Build: https://jenkins.thetaphi.de/job/Lucene-Solr-7.0-Windows/180/
Java: 64bit/jdk1.8.0_144 -XX:+UseCompressedOops -XX:+UseSerialGC

2 tests failed.
FAILED:  org.apache.solr.cloud.TestTlogReplica.testOnlyLeaderIndexes

Error Message:


Stack Trace:
java.lang.AssertionError
        at 
__randomizedtesting.SeedInfo.seed([625C2FF31CC2D857:7E5D527E6967A6C4]:0)
        at org.junit.Assert.fail(Assert.java:92)
        at org.junit.Assert.assertTrue(Assert.java:43)
        at org.junit.Assert.assertFalse(Assert.java:68)
        at org.junit.Assert.assertFalse(Assert.java:79)
        at 
org.apache.solr.cloud.TestTlogReplica.testOnlyLeaderIndexes(TestTlogReplica.java:497)
        at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
        at 
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
        at 
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
        at java.lang.reflect.Method.invoke(Method.java:498)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1713)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:907)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:943)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:957)
        at 
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
        at 
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
        at 
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
        at 
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:916)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:802)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:852)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:863)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
        at 
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
        at 
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
        at java.lang.Thread.run(Thread.java:748)


FAILED:  
junit.framework.TestSuite.org.apache.solr.handler.component.DistributedMLTComponentTest

Error Message:
Could not remove the following files (in the order of attempts):    
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2\collection1:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2\collection1
    
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2
    
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001
 

Stack Trace:
java.io.IOException: Could not remove the following files (in the order of 
attempts):
   
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2\collection1:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2\collection1
   
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2
   
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001

        at __randomizedtesting.SeedInfo.seed([625C2FF31CC2D857]:0)
        at org.apache.lucene.util.IOUtils.rm(IOUtils.java:329)
        at 
org.apache.lucene.util.TestRuleTemporaryFilesCleanup.afterAlways(TestRuleTemporaryFilesCleanup.java:216)
        at 
com.carrotsearch.randomizedtesting.rules.TestRuleAdapter$1.afterAlways(TestRuleAdapter.java:31)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:43)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
        at 
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
        at java.lang.Thread.run(Thread.java:748)




Build Log:
[...truncated 12599 lines...]
   [junit4] Suite: org.apache.solr.handler.component.DistributedMLTComponentTest
   [junit4]   2> Creating dataDir: 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\init-core-data-001
   [junit4]   2> 1664377 INFO  
(SUITE-DistributedMLTComponentTest-seed#[625C2FF31CC2D857]-worker) [    ] 
o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true) 
w/NUMERIC_DOCVALUES_SYSPROP=false
   [junit4]   2> 1664382 INFO  
(SUITE-DistributedMLTComponentTest-seed#[625C2FF31CC2D857]-worker) [    ] 
o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (true) via: 
@org.apache.solr.util.RandomizeSSL(reason=, value=NaN, ssl=NaN, clientAuth=NaN)
   [junit4]   2> 1664382 INFO  
(SUITE-DistributedMLTComponentTest-seed#[625C2FF31CC2D857]-worker) [    ] 
o.a.s.BaseDistributedSearchTestCase Setting hostContext system property: /y_/cp
   [junit4]   2> 1664803 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.SolrTestCaseJ4 Writing core.properties file to 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\control\cores\collection1
   [junit4]   2> 1664805 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.Server jetty-9.3.14.v20161028
   [junit4]   2> 1664806 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@2b15abc6{/y_/cp,null,AVAILABLE}
   [junit4]   2> 1664806 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@5d2fcb67{HTTP/1.1,[http/1.1]}{127.0.0.1:53064}
   [junit4]   2> 1664806 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.Server Started @1667725ms
   [junit4]   2> 1664806 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/y_/cp, 
hostPort=53064, 
coreRootDirectory=C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\control\cores}
   [junit4]   2> 1664807 ERROR 
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 1664807 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 
7.0.1
   [junit4]   2> 1664807 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone mode on 
port null
   [junit4]   2> 1664807 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null, Default config 
dir: null
   [junit4]   2> 1664807 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-10-02T07:24:45.937Z
   [junit4]   2> 1664808 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.SolrXmlConfig Loading container configuration from 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\control\solr.xml
   [junit4]   2> 1664822 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 1664889 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1664896 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1664896 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1664899 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\control\cores
   [junit4]   2> 1664899 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 1664900 INFO  (coreLoadExecutor-8516-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 1664900 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, 
from paths: 
[/C:/Users/jenkins/workspace/Lucene-Solr-7.0-Windows/solr/core/src/test-files/solr/collection1/lib,
 
/C:/Users/jenkins/workspace/Lucene-Solr-7.0-Windows/solr/core/src/test-files/solr/collection1/lib/classes]
   [junit4]   2> 1664968 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.0.1
   [junit4]   2> 1664984 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 1665075 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
   [junit4]   2> 1665092 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from configset 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\core\src\test-files\solr\collection1,
 trusted=true
   [junit4]   2> 1665092 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1665093 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1665093 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\core\src\test-files\solr\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\control\cores\collection1\data\]
   [junit4]   2> 1665110 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=15, maxMergeAtOnceExplicit=41, maxMergedSegmentMB=22.5068359375, 
floorSegmentMB=1.080078125, forceMergeDeletesPctAllowed=12.852692314339286, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.7943300468678157
   [junit4]   2> 1665219 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.u.UpdateHandler Using UpdateLog implementation: 
org.apache.solr.update.UpdateLog
   [junit4]   2> 1665220 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= 
defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 
numVersionBuckets=65536
   [junit4]   2> 1665222 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1665223 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1665226 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=15, maxMergeAtOnceExplicit=30, maxMergedSegmentMB=38.232421875, 
floorSegmentMB=1.974609375, forceMergeDeletesPctAllowed=12.547988415801703, 
segmentsPerTier=39.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.8559955753526725
   [junit4]   2> 1665228 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@5dfcec48[collection1] main]
   [junit4]   2> 1665232 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 1665245 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 1665278 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 1665278 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 1665280 INFO  (coreLoadExecutor-8516-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Could not find max version in index or recent 
updates, using new clock 1580129673711452160
   [junit4]   2> 1665282 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 1665282 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 1665282 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 1665283 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 1665285 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 1665286 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 1665287 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 1665287 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 1665287 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@5dfcec48[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1666191 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.SolrTestCaseJ4 Writing core.properties file to 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard0\cores\collection1
   [junit4]   2> 1666193 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.Server jetty-9.3.14.v20161028
   [junit4]   2> 1666193 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@162e2f5f{/y_/cp,null,AVAILABLE}
   [junit4]   2> 1666194 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@1dc0080{HTTP/1.1,[http/1.1]}{127.0.0.1:53070}
   [junit4]   2> 1666194 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.Server Started @1669112ms
   [junit4]   2> 1666194 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/y_/cp, 
hostPort=53070, 
coreRootDirectory=C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard0\cores}
   [junit4]   2> 1666194 ERROR 
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 1666195 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 
7.0.1
   [junit4]   2> 1666195 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone mode on 
port null
   [junit4]   2> 1666195 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null, Default config 
dir: null
   [junit4]   2> 1666195 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-10-02T07:24:47.325Z
   [junit4]   2> 1666195 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.SolrXmlConfig Loading container configuration from 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard0\solr.xml
   [junit4]   2> 1666203 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 1666291 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1666298 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1666298 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1666301 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard0\cores
   [junit4]   2> 1666301 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 1666340 INFO  (coreLoadExecutor-8527-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 1666341 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, 
from paths: 
[/C:/Users/jenkins/workspace/Lucene-Solr-7.0-Windows/solr/core/src/test-files/solr/collection1/lib,
 
/C:/Users/jenkins/workspace/Lucene-Solr-7.0-Windows/solr/core/src/test-files/solr/collection1/lib/classes]
   [junit4]   2> 1666394 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.0.1
   [junit4]   2> 1666415 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 1666499 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
   [junit4]   2> 1666508 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from configset 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\core\src\test-files\solr\collection1,
 trusted=true
   [junit4]   2> 1666508 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1666508 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1666508 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\core\src\test-files\solr\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard0\cores\collection1\data\]
   [junit4]   2> 1666511 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=15, maxMergeAtOnceExplicit=41, maxMergedSegmentMB=22.5068359375, 
floorSegmentMB=1.080078125, forceMergeDeletesPctAllowed=12.852692314339286, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.7943300468678157
   [junit4]   2> 1666589 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.u.UpdateHandler Using UpdateLog implementation: 
org.apache.solr.update.UpdateLog
   [junit4]   2> 1666589 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= 
defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 
numVersionBuckets=65536
   [junit4]   2> 1666590 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1666590 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1666591 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=15, maxMergeAtOnceExplicit=30, maxMergedSegmentMB=38.232421875, 
floorSegmentMB=1.974609375, forceMergeDeletesPctAllowed=12.547988415801703, 
segmentsPerTier=39.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.8559955753526725
   [junit4]   2> 1666591 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@6e708353[collection1] main]
   [junit4]   2> 1666592 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 1666597 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 1666639 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 1666639 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 1666639 INFO  (coreLoadExecutor-8527-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Could not find max version in index or recent 
updates, using new clock 1580129675136466944
   [junit4]   2> 1666640 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 1666640 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 1666640 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 1666640 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 1666640 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 1666641 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 1666641 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 1666641 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 1666642 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@6e708353[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1667115 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.SolrTestCaseJ4 Writing core.properties file to 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard1\cores\collection1
   [junit4]   2> 1667120 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.Server jetty-9.3.14.v20161028
   [junit4]   2> 1667121 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@56ab685a{/y_/cp,null,AVAILABLE}
   [junit4]   2> 1667122 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@2ae03a1a{HTTP/1.1,[http/1.1]}{127.0.0.1:53078}
   [junit4]   2> 1667122 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.Server Started @1670041ms
   [junit4]   2> 1667122 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/y_/cp, 
hostPort=53078, 
coreRootDirectory=C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard1\cores}
   [junit4]   2> 1667124 ERROR 
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 1667124 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 
7.0.1
   [junit4]   2> 1667124 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone mode on 
port null
   [junit4]   2> 1667124 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null, Default config 
dir: null
   [junit4]   2> 1667124 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-10-02T07:24:48.254Z
   [junit4]   2> 1667125 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.SolrXmlConfig Loading container configuration from 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard1\solr.xml
   [junit4]   2> 1667137 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 1667229 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1667237 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1667237 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1667240 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard1\cores
   [junit4]   2> 1667240 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 1667241 INFO  (coreLoadExecutor-8538-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 1667242 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, 
from paths: 
[/C:/Users/jenkins/workspace/Lucene-Solr-7.0-Windows/solr/core/src/test-files/solr/collection1/lib,
 
/C:/Users/jenkins/workspace/Lucene-Solr-7.0-Windows/solr/core/src/test-files/solr/collection1/lib/classes]
   [junit4]   2> 1667298 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.0.1
   [junit4]   2> 1667314 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 1667407 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
   [junit4]   2> 1667415 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from configset 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\core\src\test-files\solr\collection1,
 trusted=true
   [junit4]   2> 1667415 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1667415 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1667415 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\core\src\test-files\solr\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard1\cores\collection1\data\]
   [junit4]   2> 1667417 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=15, maxMergeAtOnceExplicit=41, maxMergedSegmentMB=22.5068359375, 
floorSegmentMB=1.080078125, forceMergeDeletesPctAllowed=12.852692314339286, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.7943300468678157
   [junit4]   2> 1667498 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.u.UpdateHandler Using UpdateLog implementation: 
org.apache.solr.update.UpdateLog
   [junit4]   2> 1667499 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= 
defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 
numVersionBuckets=65536
   [junit4]   2> 1667500 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1667500 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1667501 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=15, maxMergeAtOnceExplicit=30, maxMergedSegmentMB=38.232421875, 
floorSegmentMB=1.974609375, forceMergeDeletesPctAllowed=12.547988415801703, 
segmentsPerTier=39.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.8559955753526725
   [junit4]   2> 1667501 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@5b8f7e5a[collection1] main]
   [junit4]   2> 1667502 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 1667511 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 1667547 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 1667547 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 1667547 INFO  (coreLoadExecutor-8538-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Could not find max version in index or recent 
updates, using new clock 1580129676088573952
   [junit4]   2> 1667547 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 1667547 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 1667547 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 1667548 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 1667549 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 1667549 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 1667549 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 1667550 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 1667551 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@5b8f7e5a[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1668030 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.SolrTestCaseJ4 Writing core.properties file to 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2\cores\collection1
   [junit4]   2> 1668032 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.Server jetty-9.3.14.v20161028
   [junit4]   2> 1668032 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@24e60222{/y_/cp,null,AVAILABLE}
   [junit4]   2> 1668034 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@741c4ca2{HTTP/1.1,[http/1.1]}{127.0.0.1:53081}
   [junit4]   2> 1668034 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.e.j.s.Server Started @1670952ms
   [junit4]   2> 1668034 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/y_/cp, 
hostPort=53081, 
coreRootDirectory=C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2\cores}
   [junit4]   2> 1668034 ERROR 
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 1668034 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 
7.0.1
   [junit4]   2> 1668034 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone mode on 
port null
   [junit4]   2> 1668034 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null, Default config 
dir: null
   [junit4]   2> 1668034 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-10-02T07:24:49.164Z
   [junit4]   2> 1668035 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.SolrXmlConfig Loading container configuration from 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2\solr.xml
   [junit4]   2> 1668041 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 1668116 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1668125 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1668125 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1668130 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2\cores
   [junit4]   2> 1668130 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 1668131 INFO  (coreLoadExecutor-8549-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 1668131 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, 
from paths: 
[/C:/Users/jenkins/workspace/Lucene-Solr-7.0-Windows/solr/core/src/test-files/solr/collection1/lib,
 
/C:/Users/jenkins/workspace/Lucene-Solr-7.0-Windows/solr/core/src/test-files/solr/collection1/lib/classes]
   [junit4]   2> 1668184 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.0.1
   [junit4]   2> 1668230 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 1668327 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
   [junit4]   2> 1668337 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from configset 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\core\src\test-files\solr\collection1,
 trusted=true
   [junit4]   2> 1668337 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@7dd283d9
   [junit4]   2> 1668337 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1668337 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\core\src\test-files\solr\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.handler.component.DistributedMLTComponentTest_625C2FF31CC2D857-001\tempDir-001\shard2\cores\collection1\data\]
   [junit4]   2> 1668339 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=15, maxMergeAtOnceExplicit=41, maxMergedSegmentMB=22.5068359375, 
floorSegmentMB=1.080078125, forceMergeDeletesPctAllowed=12.852692314339286, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.7943300468678157
   [junit4]   2> 1668425 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.u.UpdateHandler Using UpdateLog implementation: 
org.apache.solr.update.UpdateLog
   [junit4]   2> 1668425 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= 
defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 
numVersionBuckets=65536
   [junit4]   2> 1668426 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1668426 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1668427 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=15, maxMergeAtOnceExplicit=30, maxMergedSegmentMB=38.232421875, 
floorSegmentMB=1.974609375, forceMergeDeletesPctAllowed=12.547988415801703, 
segmentsPerTier=39.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.8559955753526725
   [junit4]   2> 1668427 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@1995a88c[collection1] main]
   [junit4]   2> 1668428 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 1668437 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 1668468 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 1668468 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 1668469 INFO  (coreLoadExecutor-8549-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Could not find max version in index or recent 
updates, using new clock 1580129677055361024
   [junit4]   2> 1668471 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 1668471 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 1668471 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 1668472 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 1668472 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 1668472 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 1668473 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 1668473 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 1668476 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@1995a88c[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1668979 INFO  
(TEST-DistributedMLTComponentTest.test-seed#[625C2FF31CC2D857]) [    ] 
o.a.s.SolrTestCaseJ4 ###Starting test
   [junit4]   2> 1668992 INFO  (qtp1325294780-17939) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{deleteByQuery=*:* (-1580129677602717696)} 0 1
   [junit4]   2> 1669001 INFO  (qtp666924566-17959) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{deleteByQuery=*:* (-1580129677605863424)} 0 7
   [junit4]   2> 1669012 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{deleteByQuery=*:* (-1580129677615300608)} 0 9
   [junit4]   2> 1669023 INFO  (qtp1787034192-17996) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{deleteByQuery=*:* (-1580129677627883520)} 0 7
   [junit4]   2> 1669028 INFO  (qtp1325294780-17943) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[1 (1580129677637320704)]} 0 3
   [junit4]   2> 1669032 INFO  (qtp666924566-17961) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[1 (1580129677641515008)]} 0 3
   [junit4]   2> 1669033 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[2 (1580129677646757888)]} 0 0
   [junit4]   2> 1669038 INFO  (qtp1932811662-17979) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[2 (1580129677647806464)]} 0 3
   [junit4]   2> 1669038 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[3 (1580129677652000768)]} 0 0
   [junit4]   2> 1669048 INFO  (qtp1787034192-17998) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[3 (1580129677652000768)]} 0 9
   [junit4]   2> 1669049 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[4 (1580129677663535104)]} 0 0
   [junit4]   2> 1669050 INFO  (qtp666924566-17962) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[4 (1580129677664583680)]} 0 0
   [junit4]   2> 1669051 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[5 (1580129677665632256)]} 0 0
   [junit4]   2> 1669051 INFO  (qtp1932811662-17980) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[5 (1580129677665632256)]} 0 0
   [junit4]   2> 1669052 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[6 (1580129677666680832)]} 0 0
   [junit4]   2> 1669055 INFO  (qtp1787034192-17998) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[6 (1580129677668777984)]} 0 1
   [junit4]   2> 1669056 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[7 (1580129677669826560)]} 0 0
   [junit4]   2> 1669057 INFO  (qtp666924566-17962) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[7 (1580129677671923712)]} 0 0
   [junit4]   2> 1669057 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[8 (1580129677671923712)]} 0 0
   [junit4]   2> 1669058 INFO  (qtp1932811662-17980) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[8 (1580129677671923712)]} 0 0
   [junit4]   2> 1669058 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[9 (1580129677672972288)]} 0 0
   [junit4]   2> 1669157 INFO  (qtp1787034192-17998) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[9 (1580129677775732736)]} 0 0
   [junit4]   2> 1669157 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[10 (1580129677776781312)]} 0 0
   [junit4]   2> 1669158 INFO  (qtp666924566-17962) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[10 (1580129677777829888)]} 0 0
   [junit4]   2> 1669158 INFO  (qtp1325294780-17950) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[12 (1580129677777829888)]} 0 0
   [junit4]   2> 1669158 INFO  (qtp1787034192-17999) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[12 (1580129677777829888)]} 0 0
   [junit4]   2> 1669159 INFO  (qtp1325294780-17942) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[13 (1580129677778878464)]} 0 0
   [junit4]   2> 1669160 INFO  (qtp666924566-17965) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[13 (1580129677778878464)]} 0 0
   [junit4]   2> 1669160 INFO  (qtp1325294780-17939) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[14 (1580129677779927040)]} 0 0
   [junit4]   2> 1669161 INFO  (qtp1932811662-17980) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[14 (1580129677779927040)]} 0 0
   [junit4]   2> 1669161 INFO  (qtp1325294780-17939) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[15 (1580129677780975616)]} 0 0
   [junit4]   2> 1669161 INFO  (qtp1787034192-18000) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[15 (1580129677780975616)]} 0 0
   [junit4]   2> 1669163 INFO  (qtp1325294780-17943) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[16 (1580129677780975617)]} 0 0
   [junit4]   2> 1669163 INFO  (qtp666924566-17966) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[16 (1580129677783072768)]} 0 0
   [junit4]   2> 1669164 INFO  (qtp1325294780-17945) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[17 (1580129677784121344)]} 0 0
   [junit4]   2> 1669164 INFO  (qtp1932811662-17980) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[17 (1580129677784121344)]} 0 0
   [junit4]   2> 1669166 INFO  (qtp1325294780-17946) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[18 (1580129677785169920)]} 0 0
   [junit4]   2> 1669166 INFO  (qtp1787034192-18000) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[18 (1580129677786218496)]} 0 0
   [junit4]   2> 1669167 INFO  (qtp1325294780-17948) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[19 (1580129677786218496)]} 0 0
   [junit4]   2> 1669167 INFO  (qtp666924566-17959) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[19 (1580129677787267072)]} 0 0
   [junit4]   2> 1669168 INFO  (qtp1325294780-17949) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[20 (1580129677788315648)]} 0 0
   [junit4]   2> 1669169 INFO  (qtp1932811662-17987) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[20 (1580129677788315648)]} 0 0
   [junit4]   2> 1669169 INFO  (qtp1325294780-17944) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[21 (1580129677789364224)]} 0 0
   [junit4]   2> 1669170 INFO  (qtp1787034192-18002) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[21 (1580129677789364224)]} 0 0
   [junit4]   2> 1669170 INFO  (qtp1325294780-17950) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[22 (1580129677790412800)]} 0 0
   [junit4]   2> 1669170 INFO  (qtp666924566-17961) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[22 (1580129677790412800)]} 0 0
   [junit4]   2> 1669171 INFO  (qtp1325294780-17950) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[23 (1580129677791461376)]} 0 0
   [junit4]   2> 1669171 INFO  (qtp1932811662-17988) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[23 (1580129677791461376)]} 0 0
   [junit4]   2> 1669172 INFO  (qtp1325294780-17950) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[24 (1580129677792509952)]} 0 0
   [junit4]   2> 1669172 INFO  (qtp1787034192-18002) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[24 (1580129677792509952)]} 0 0
   [junit4]   2> 1669172 INFO  (qtp1325294780-17943) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[25 (1580129677792509953)]} 0 0
   [junit4]   2> 1669173 INFO  (qtp666924566-17961) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={wt=javabin&version=2}{add=[25 (1580129677793558528)]} 0 0
   [junit4]   2> 1669173 INFO  (qtp1325294780-17945) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 start 
commit{_version_=1580129677793558528,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 1669173 INFO  (qtp1325294780-17945) [    x:collection1] 
o.a.s.u.SolrIndexWriter Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@6362cc50 
commitCommandVersion:1580129677793558528
   [junit4]   2> 1669190 INFO  (qtp1325294780-17945) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@32ca0d77[collection1] main]
   [junit4]   2> 1669193 INFO  
(searcherExecutor-8517-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@32ca0d77[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.0.1):c24)))}
   [junit4]   2> 1669193 INFO  (qtp1325294780-17945) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 1669193 INFO  (qtp1325294780-17945) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 19
   [junit4]   2> 1669194 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 start 
commit{_version_=1580129677815578624,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 1669194 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.u.SolrIndexWriter Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@5259c8c1 
commitCommandVersion:1580129677815578624
   [junit4]   2> 1669203 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@1acd2698[collection1] main]
   [junit4]   2> 1669205 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 1669207 INFO  
(searcherExecutor-8528-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@1acd2698[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.0.1):c9)))}
   [junit4]   2> 1669207 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 13
   [junit4]   2> 1669207 INFO  (qtp1932811662-17989) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 start 
commit{_version_=1580129677829210112,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 1669207 INFO  (qtp1932811662-17989) [    x:collection1] 
o.a.s.u.SolrIndexWriter Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@691ff1a1 
commitCommandVersion:1580129677829210112
   [junit4]   2> 1669215 INFO  (qtp1932811662-17989) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@66a9090a[collection1] main]
   [junit4]   2> 1669218 INFO  
(searcherExecutor-8539-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@66a9090a[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.0.1):c7)))}
   [junit4]   2> 1669220 INFO  (qtp1932811662-17989) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 1669221 INFO  (qtp1932811662-17989) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 13
   [junit4]   2> 1669221 INFO  (qtp1787034192-17996) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 start 
commit{_version_=1580129677843890176,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 1669221 INFO  (qtp1787034192-17996) [    x:collection1] 
o.a.s.u.SolrIndexWriter Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@1408dc4 
commitCommandVersion:1580129677843890176
   [junit4]   2> 1669231 INFO  (qtp1787034192-17996) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@2dd00d00[collection1] main]
   [junit4]   2> 1669234 INFO  
(searcherExecutor-8550-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@2dd00d00[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.0.1):c8)))}
   [junit4]   2> 1669234 INFO  (qtp1787034192-17996) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 1669234 INFO  (qtp1787034192-17996) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/y_/cp path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 13
   [junit4]   2> 1669241 INFO  (qtp1325294780-17946) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={q=match_none&distrib=false&qt=mltrh&mlt=true&mlt.fl=lowerfilt&wt=javabin&version=2&shards.qt=mltrh}
 hits=0 status=0 QTime=5
   [junit4]   2> 1669244 INFO  (qtp666924566-17962) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=http://127.0.0.1:53070/y_/cp/collection1|[ff01::213]:33332/y_/cp|[ff01::114]:33332/y_/cp|[ff01::083]:33332/y_/cp&rows=10&version=2&shards.qt=mltrh&q=match_none&mlt=true&NOW=1506929090371&mlt.fl=lowerfilt&isShard=true&wt=javabin}
 hits=0 status=0 QTime=0
   [junit4]   2> 1669250 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=[ff01::083]:33332/y_/cp|http://127.0.0.1:53078/y_/cp/collection1|[ff01::114]:33332/y_/cp&rows=10&version=2&shards.qt=mltrh&q=match_none&mlt=true&NOW=1506929090371&mlt.fl=lowerfilt&isShard=true&wt=javabin}
 hits=0 status=0 QTime=0
   [junit4]   2> 1669251 INFO  (qtp1787034192-17998) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=[ff01::083]:33332/y_/cp|http://127.0.0.1:53081/y_/cp/collection1&rows=10&version=2&shards.qt=mltrh&q=match_none&mlt=true&NOW=1506929090371&mlt.fl=lowerfilt&isShard=true&wt=javabin}
 hits=0 status=0 QTime=0
   [junit4]   2> 1669252 INFO  (qtp1787034192-17996) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={q=match_none&shards=http://127.0.0.1:53070/y_/cp/collection1|[ff01::213]:33332/y_/cp|[ff01::114]:33332/y_/cp|[ff01::083]:33332/y_/cp,[ff01::083]:33332/y_/cp|http://127.0.0.1:53078/y_/cp/collection1|[ff01::114]:33332/y_/cp,[ff01::083]:33332/y_/cp|http://127.0.0.1:53081/y_/cp/collection1&qt=mltrh&mlt=true&mlt.fl=lowerfilt&wt=javabin&version=2&shards.qt=mltrh}
 hits=0 status=0 QTime=10
   [junit4]   2> 1669252 INFO  (qtp1325294780-17946) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={q=lowerfilt:sonata&distrib=false&qt=mltrh&mlt=true&mlt.fl=lowerfilt&wt=javabin&version=2&shards.qt=mltrh}
 hits=1 status=0 QTime=0
   [junit4]   2> 1669254 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=http://127.0.0.1:53078/y_/cp/collection1|[ff01::114]:33332/y_/cp&rows=10&version=2&shards.qt=mltrh&q=lowerfilt:sonata&mlt=true&NOW=1506929090383&mlt.fl=lowerfilt&isShard=true&wt=javabin}
 hits=1 status=0 QTime=0
   [junit4]   2> 1669254 INFO  (qtp666924566-17962) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=[ff01::114]:33332/y_/cp|http://127.0.0.1:53070/y_/cp/collection1|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp&rows=10&version=2&shards.qt=mltrh&q=lowerfilt:sonata&mlt=true&NOW=1506929090383&mlt.fl=lowerfilt&isShard=true&wt=javabin}
 hits=0 status=0 QTime=0
   [junit4]   2> 1669255 INFO  (qtp1787034192-17999) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=[ff01::083]:33332/y_/cp|http://127.0.0.1:53081/y_/cp/collection1|[ff01::213]:33332/y_/cp|[ff01::114]:33332/y_/cp&rows=10&version=2&shards.qt=mltrh&q=lowerfilt:sonata&mlt=true&NOW=1506929090383&mlt.fl=lowerfilt&isShard=true&wt=javabin}
 hits=0 status=0 QTime=0
   [junit4]   2> 1669255 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&shards.purpose=64&shard.url=http://127.0.0.1:53078/y_/cp/collection1|[ff01::114]:33332/y_/cp&version=2&shards.qt=mltrh&q=lowerfilt:sonata&mlt=false&NOW=1506929090383&mlt.fl=lowerfilt&ids=8&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 1669256 INFO  (qtp1787034192-17998) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={q=lowerfilt:sonata&shards=[ff01::114]:33332/y_/cp|http://127.0.0.1:53070/y_/cp/collection1|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp,http://127.0.0.1:53078/y_/cp/collection1|[ff01::114]:33332/y_/cp,[ff01::083]:33332/y_/cp|http://127.0.0.1:53081/y_/cp/collection1|[ff01::213]:33332/y_/cp|[ff01::114]:33332/y_/cp&qt=mltrh&mlt=true&mlt.fl=lowerfilt&wt=javabin&version=2&shards.qt=mltrh}
 hits=1 status=0 QTime=2
   [junit4]   2> 1669257 INFO  (qtp1325294780-17946) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={distrib=false&qt=mltrh&fl=id&sort=id_i1+desc&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&q=lowerfilt:moon&mlt=true&mlt.fl=lowerfilt&wt=javabin&mlt.mindf=1}
 hits=2 status=0 QTime=0
   [junit4]   2> 1669258 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&shards.purpose=68&start=0&fsv=true&sort=id_i1+desc&shard.url=http://127.0.0.1:53078/y_/cp/collection1&rows=10&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&q=lowerfilt:moon&mlt=true&NOW=1506929090388&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=1 status=0 QTime=0
   [junit4]   2> 1669258 INFO  (qtp666924566-17962) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&shards.purpose=68&start=0&fsv=true&sort=id_i1+desc&shard.url=http://127.0.0.1:53070/y_/cp/collection1&rows=10&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&q=lowerfilt:moon&mlt=true&NOW=1506929090388&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=1 status=0 QTime=0
   [junit4]   2> 1669262 INFO  (qtp1787034192-18003) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&shards.purpose=68&start=0&fsv=true&sort=id_i1+desc&shard.url=http://127.0.0.1:53081/y_/cp/collection1&rows=10&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&q=lowerfilt:moon&mlt=true&NOW=1506929090388&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=0 status=0 QTime=1
   [junit4]   2> 1669264 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53078/y_/cp/collection1&rows=20&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&mlt.dist.id=17&q=%2B(lowerfilt:the+lowerfilt:moon.+lowerfilt:and+lowerfilt:foxes+lowerfilt:moon)+-id:17&mlt=true&NOW=1506929090388&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=3 status=0 QTime=0
   [junit4]   2> 1669264 INFO  (qtp666924566-17962) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53070/y_/cp/collection1&rows=20&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&mlt.dist.id=17&q=%2B(lowerfilt:the+lowerfilt:moon.+lowerfilt:and+lowerfilt:foxes+lowerfilt:moon)+-id:17&mlt=true&NOW=1506929090388&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=5 status=0 QTime=1
   [junit4]   2> 1669267 INFO  (qtp1787034192-18003) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53081/y_/cp/collection1&rows=20&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&mlt.dist.id=17&q=%2B(lowerfilt:the+lowerfilt:moon.+lowerfilt:and+lowerfilt:foxes+lowerfilt:moon)+-id:17&mlt=true&NOW=1506929090388&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=5 status=0 QTime=1
   [junit4]   2> 1669270 INFO  (qtp666924566-17962) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53070/y_/cp/collection1&rows=20&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&mlt.dist.id=7&q=%2B(lowerfilt:the+lowerfilt:and+lowerfilt:moon)+-id:7&mlt=true&NOW=1506929090388&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=0
   [junit4]   2> 1669271 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53078/y_/cp/collection1&rows=20&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&mlt.dist.id=7&q=%2B(lowerfilt:the+lowerfilt:and+lowerfilt:moon)+-id:7&mlt=true&NOW=1506929090388&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=0
   [junit4]   2> 1669272 INFO  (qtp1787034192-18003) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53081/y_/cp/collection1&rows=20&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&mlt.dist.id=7&q=%2B(lowerfilt:the+lowerfilt:and+lowerfilt:moon)+-id:7&mlt=true&NOW=1506929090388&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=5 status=0 QTime=0
   [junit4]   2> 1669273 INFO  (qtp1787034192-18000) [    x:collection1] 
o.a.s.h.c.MoreLikeThisComponent MLT: results added for key: 17 documents: 
{numFound=3,start=0,maxScore=0.65740556,docs=[SolrDocument{id=14, 
score=0.65740556}, SolrDocument{id=20, score=0.65740556}, SolrDocument{id=23, 
score=0.65740556}]}
   [junit4]   2> 1669273 INFO  (qtp1787034192-18000) [    x:collection1] 
o.a.s.h.c.MoreLikeThisComponent MLT: results added for key: 17 documents: 
{numFound=5,start=0,maxScore=3.4950314,docs=[SolrDocument{id=7, 
score=3.4950314}, SolrDocument{id=13, score=0.67566174}, SolrDocument{id=16, 
score=0.67566174}, SolrDocument{id=19, score=0.67566174}, SolrDocument{id=22, 
score=0.67566174}]}
   [junit4]   2> 1669274 INFO  (qtp1787034192-18000) [    x:collection1] 
o.a.s.h.c.MoreLikeThisComponent MLT: results added for key: 17 documents: 
{numFound=5,start=0,maxScore=1.2457749,docs=[SolrDocument{id=9, 
score=1.2457749}, SolrDocument{id=15, score=0.62854314}, SolrDocument{id=18, 
score=0.62854314}, SolrDocument{id=21, score=0.62854314}, SolrDocument{id=24, 
score=0.62854314}]}
   [junit4]   2> 1669274 INFO  (qtp1787034192-18000) [    x:collection1] 
o.a.s.h.c.MoreLikeThisComponent MLT: results added for key: 7 documents: 
{numFound=4,start=0,maxScore=0.67566174,docs=[SolrDocument{id=13, 
score=0.67566174}, SolrDocument{id=16, score=0.67566174}, SolrDocument{id=19, 
score=0.67566174}, SolrDocument{id=22, score=0.67566174}]}
   [junit4]   2> 1669274 INFO  (qtp1787034192-18000) [    x:collection1] 
o.a.s.h.c.MoreLikeThisComponent MLT: results added for key: 7 documents: 
{numFound=4,start=0,maxScore=2.0108068,docs=[SolrDocument{id=17, 
score=2.0108068}, SolrDocument{id=14, score=0.65740556}, SolrDocument{id=20, 
score=0.65740556}, SolrDocument{id=23, score=0.65740556}]}
   [junit4]   2> 1669274 INFO  (qtp1787034192-18000) [    x:collection1] 
o.a.s.h.c.MoreLikeThisComponent MLT: results added for key: 7 documents: 
{numFound=5,start=0,maxScore=1.2457749,docs=[SolrDocument{id=9, 
score=1.2457749}, SolrDocument{id=15, score=0.62854314}, SolrDocument{id=18, 
score=0.62854314}, SolrDocument{id=21, score=0.62854314}, SolrDocument{id=24, 
score=0.62854314}]}
   [junit4]   2> 1669274 INFO  (qtp1787034192-18000) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={qt=mltrh&fl=id&sort=id_i1+desc&mlt.count=20&version=2&mlt.mintf=2&shards.qt=mltrh&q=lowerfilt:moon&shards=http://127.0.0.1:53070/y_/cp/collection1,http://127.0.0.1:53078/y_/cp/collection1,http://127.0.0.1:53081/y_/cp/collection1&mlt=true&mlt.fl=lowerfilt&wt=javabin&mlt.mindf=1}
 hits=2 status=0 QTime=15
   [junit4]   2> 1669277 INFO  (qtp1325294780-17946) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={distrib=false&qt=mltrh&fl=id&sort=id_i1+desc&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&q=lowerfilt:fox&mlt=true&mlt.fl=lowerfilt&wt=javabin&mlt.mindf=1}
 hits=13 status=0 QTime=2
   [junit4]   2> 1669290 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&shards.purpose=68&start=0&fsv=true&sort=id_i1+desc&shard.url=http://127.0.0.1:53070/y_/cp/collection1|[ff01::114]:33332/y_/cp|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp&rows=10&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&q=lowerfilt:fox&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=0
   [junit4]   2> 1669293 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&shards.purpose=68&start=0&fsv=true&sort=id_i1+desc&shard.url=http://127.0.0.1:53078/y_/cp/collection1|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp|[ff01::114]:33332/y_/cp&rows=10&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&q=lowerfilt:fox&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=0
   [junit4]   2> 1669296 INFO  (qtp1787034192-18003) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=id&shards.purpose=68&start=0&fsv=true&sort=id_i1+desc&shard.url=http://127.0.0.1:53081/y_/cp/collection1|[ff01::213]:33332/y_/cp&rows=10&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&q=lowerfilt:fox&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=5 status=0 QTime=0
   [junit4]   2> 1669301 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53070/y_/cp/collection1|[ff01::114]:33332/y_/cp|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=22&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:dogs.+lowerfilt:jumped+lowerfilt:lazy+lowerfilt:brown+lowerfilt:over+lowerfilt:quote+lowerfilt:the)+-id:22&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=2
   [junit4]   2> 1669302 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53078/y_/cp/collection1|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp|[ff01::114]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=22&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:dogs.+lowerfilt:jumped+lowerfilt:lazy+lowerfilt:brown+lowerfilt:over+lowerfilt:quote+lowerfilt:the)+-id:22&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=2
   [junit4]   2> 1669303 INFO  (qtp1787034192-18003) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53081/y_/cp/collection1|[ff01::213]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=22&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:dogs.+lowerfilt:jumped+lowerfilt:lazy+lowerfilt:brown+lowerfilt:over+lowerfilt:quote+lowerfilt:the)+-id:22&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=5 status=0 QTime=1
   [junit4]   2> 1669331 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53070/y_/cp/collection1|[ff01::114]:33332/y_/cp|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=19&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:dogs.+lowerfilt:brown+lowerfilt:jumped+lowerfilt:lazy+lowerfilt:over+lowerfilt:hose+lowerfilt:the)+-id:19&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=25
   [junit4]   2> 1669331 INFO  (qtp1787034192-18003) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53081/y_/cp/collection1|[ff01::213]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=9&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:brown+lowerfilt:lazy+lowerfilt:jumped+lowerfilt:over+lowerfilt:dogs.+lowerfilt:and+lowerfilt:quick+lowerfilt:big+lowerfilt:large+lowerfilt:the)+-id:9&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=0
   [junit4]   2> 1669333 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53078/y_/cp/collection1|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp|[ff01::114]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=9&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:brown+lowerfilt:lazy+lowerfilt:jumped+lowerfilt:over+lowerfilt:dogs.+lowerfilt:and+lowerfilt:quick+lowerfilt:big+lowerfilt:large+lowerfilt:the)+-id:9&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=0
   [junit4]   2> 1669334 INFO  (qtp1787034192-18003) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53081/y_/cp/collection1|[ff01::213]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=15&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:dogs.+lowerfilt:jumped+lowerfilt:brown+lowerfilt:lazy+lowerfilt:over+lowerfilt:fat+lowerfilt:the)+-id:15&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=0
   [junit4]   2> 1669334 INFO  (qtp1932811662-17976) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53078/y_/cp/collection1|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp|[ff01::114]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=15&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:dogs.+lowerfilt:jumped+lowerfilt:brown+lowerfilt:lazy+lowerfilt:over+lowerfilt:fat+lowerfilt:the)+-id:15&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=0
   [junit4]   2> 1669335 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53070/y_/cp/collection1|[ff01::114]:33332/y_/cp|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=9&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:brown+lowerfilt:lazy+lowerfilt:jumped+lowerfilt:over+lowerfilt:dogs.+lowerfilt:and+lowerfilt:quick+lowerfilt:big+lowerfilt:large+lowerfilt:the)+-id:9&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=5 status=0 QTime=0
   [junit4]   2> 1669336 INFO  (qtp1787034192-18003) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53081/y_/cp/collection1|[ff01::213]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=18&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:dogs.+lowerfilt:jumped+lowerfilt:lazy+lowerfilt:brown+lowerfilt:over+lowerfilt:quote+lowerfilt:the)+-id:18&mlt=true&NOW=1506929090408&mlt.fl=lowerfilt&isShard=true&wt=javabin&mlt.mindf=1}
 hits=4 status=0 QTime=0
   [junit4]   2> 1669337 INFO  (qtp666924566-17964) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/y_/cp path=/select 
params={df=text&distrib=false&qt=mltrh&fl=score,id&shards.purpose=4097&start=0&sort=score+desc&shard.url=http://127.0.0.1:53070/y_/cp/collection1|[ff01::114]:33332/y_/cp|[ff01::083]:33332/y_/cp|[ff01::213]:33332/y_/cp&rows=20&mlt.count=20&version=2&mlt.mintf=1&shards.qt=mltrh&mlt.dist.id=15&q=%2B(lowerfilt:red+lowerfilt:fox+lowerfilt:dogs.+lowerfilt:jumped+lowerfilt:brown+lowerfilt:lazy+lowerfilt:over+lowerfilt:fat+lowerfilt:the)+-id:15&mlt=true&NOW=1506929090408&mlt.fl=lo

[...truncated too long message...]

rity.json
   [junit4]   2>        3       /solr/clusterprops.json
   [junit4]   2> 
   [junit4]   2> Maximum concurrent data watches above limit:
   [junit4]   2> 
   [junit4]   2>        40      
/solr/collections/tlog_replica_test_recovery/state.json
   [junit4]   2>        32      
/solr/collections/tlog_replica_test_create_delete/state.json
   [junit4]   2>        29      
/solr/collections/tlog_replica_test_remove_leader/state.json
   [junit4]   2>        28      
/solr/collections/tlog_replica_test_kill_leader/state.json
   [junit4]   2>        27      
/solr/collections/tlog_replica_test_out_of_order_db_qwith_in_place_updates/state.json
   [junit4]   2>        27      
/solr/collections/tlog_replica_test_basic_leader_election/state.json
   [junit4]   2>        27      
/solr/collections/tlog_replica_test_add_remove_tlog_replica/state.json
   [junit4]   2>        26      
/solr/collections/tlog_replica_test_kill_tlog_replica/state.json
   [junit4]   2>        17      
/solr/collections/tlog_replica_test_real_time_get/state.json
   [junit4]   2>        13      
/solr/collections/tlog_replica_test_only_leader_indexes/state.json
   [junit4]   2>        13      
/solr/collections/tlog_replica_test_delete_by_id/state.json
   [junit4]   2>        10      /solr/clusterstate.json
   [junit4]   2>        10      /solr/clusterprops.json
   [junit4]   2>        6       
/solr/collections/tlog_replica_test_add_docs/state.json
   [junit4]   2>        4       
/solr/collections/tlog_replica_test_recovery/leader_elect/shard1/election/98758149433524238-core_node1-n_0000000000
   [junit4]   2>        4       
/solr/overseer_elect/election/98758149433524238-127.0.0.1:57970_solr-n_0000000003
   [junit4]   2>        2       
/solr/collections/tlog_replica_test_real_time_get/leader_elect/shard1/election/98758149433524229-core_node1-n_0000000001
   [junit4]   2>        2       
/solr/collections/tlog_replica_test_kill_tlog_replica/leader_elect/shard1/election/98758149433524238-core_node2-n_0000000000
   [junit4]   2>        2       
/solr/collections/tlog_replica_test_create_delete/leader_elect/shard1/election/98758149433524235-core_node4-n_0000000000
   [junit4]   2> 
   [junit4]   2> Maximum concurrent children watches above limit:
   [junit4]   2> 
   [junit4]   2>        10      /solr/collections
   [junit4]   2>        5       /solr/overseer/queue
   [junit4]   2>        5       /solr/overseer/collection-queue-work
   [junit4]   2>        3       /solr/live_nodes
   [junit4]   2> 
   [junit4]   2> NOTE: leaving temporary files on disk at: 
C:\Users\jenkins\workspace\Lucene-Solr-7.0-Windows\solr\build\solr-core\test\J0\temp\solr.cloud.TestTlogReplica_625C2FF31CC2D857-001
   [junit4]   2> Oct 02, 2017 7:37:58 AM 
com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
   [junit4]   2> WARNING: Will linger awaiting termination of 3 leaked 
thread(s).
   [junit4]   2> NOTE: test params are: codec=Asserting(Lucene70), 
sim=RandomSimilarity(queryNorm=true): {}, locale=en, timezone=AST
   [junit4]   2> NOTE: Windows 10 10.0 amd64/Oracle Corporation 1.8.0_144 
(64-bit)/cpus=3,threads=1,free=100355880,total=518979584
   [junit4]   2> NOTE: All tests run in this JVM: [LeaderElectionTest, 
TestWriterPerf, TestSolrFieldCacheBean, ClusterStateUpdateTest, 
JavabinLoaderTest, TestRebalanceLeaders, TestLegacyFieldReuse, 
SolrTestCaseJ4Test, ZkCLITest, TestOverriddenPrefixQueryForCustomFieldType, 
HardAutoCommitTest, SolrShardReporterTest, TestLeaderElectionWithEmptyReplica, 
TestHighFrequencyDictionaryFactory, TestRandomDVFaceting, TestCryptoKeys, 
DistanceUnitsTest, TestStressInPlaceUpdates, TestObjectReleaseTracker, 
TestCloudNestedDocsSort, ResourceLoaderTest, BlockJoinFacetDistribTest, 
TestDocTermOrds, PreAnalyzedUpdateProcessorTest, SimpleFacetsTest, 
TestSortByMinMaxFunction, OverriddenZkACLAndCredentialsProvidersTest, 
TestLeaderInitiatedRecoveryThread, TestStressUserVersions, 
SimpleMLTQParserTest, TestRequestForwarding, SolrSlf4jReporterTest, 
TestFunctionQuery, XsltUpdateRequestHandlerTest, TestExportWriter, 
TestPHPSerializedResponseWriter, DistanceFunctionTest, NumericFieldsTest, 
UtilsToolTest, MoveReplicaHDFSTest, TestLRUStatsCache, CustomCollectionTest, 
HdfsCollectionsAPIDistributedZkTest, TestMultiWordSynonyms, 
HdfsRecoverLeaseTest, SoftAutoCommitTest, TestLegacyTerms, 
TestSolrConfigHandlerConcurrent, DistributedSpellCheckComponentTest, 
TemplateUpdateProcessorTest, TestManagedSchemaThreadSafety, 
ConnectionManagerTest, TestFieldCollectionResource, ReplicaListTransformerTest, 
UniqFieldsUpdateProcessorFactoryTest, TestRandomFlRTGCloud, 
SolrMetricReporterTest, TestStressVersions, TestRestManager, 
TestReplicationHandlerBackup, TestSchemaSimilarityResource, 
CloneFieldUpdateProcessorFactoryTest, TestPushWriter, TestDistributedSearch, 
PathHierarchyTokenizerFactoryTest, TestSchemaManager, TestNumericRangeQuery32, 
TestCoreContainer, NodeMutatorTest, TestIBSimilarityFactory, TestUpdate, 
TestDFISimilarityFactory, BaseCdcrDistributedZkTest, RequestHandlersTest, 
IgnoreCommitOptimizeUpdateProcessorFactoryTest, TestFieldCacheSortRandom, 
TestUninvertingReader, TestComplexPhraseQParserPlugin, 
HdfsRestartWhileUpdatingTest, TestClassNameShortening, MoveReplicaTest, 
TestExactSharedStatsCache, DistributedFacetPivotWhiteBoxTest, 
TestNumericTerms32, TestRandomCollapseQParserPlugin, TestRestoreCore, 
TestUtils, CheckHdfsIndexTest, CSVRequestHandlerTest, ClusterStateTest, 
TestJsonRequest, SolrInfoBeanTest, TestRuleBasedAuthorizationPlugin, 
TestAuthenticationFramework, JvmMetricsTest, CdcrRequestHandlerTest, TestSort, 
CloudExitableDirectoryReaderTest, SliceStateTest, DeleteReplicaTest, 
ReplicationFactorTest, HttpSolrCallGetCoreTest, DistributedExpandComponentTest, 
TestMinMaxOnMultiValuedField, TestManagedStopFilterFactory, 
TriLevelCompositeIdRoutingTest, TestSurroundQueryParser, TestBinaryField, 
FacetPivotSmallTest, DirectUpdateHandlerOptimizeTest, 
AnalysisAfterCoreReloadTest, TestCodecSupport, ReturnFieldsTest, SolrCoreTest, 
BooleanFieldTest, RegexBoostProcessorTest, FieldAnalysisRequestHandlerTest, 
TestChildDocTransformer, TestUseDocValuesAsStored, RulesTest, HighlighterTest, 
SpatialFilterTest, HdfsChaosMonkeyNothingIsSafeTest, DistributedQueueTest, 
QueryParsingTest, HdfsBasicDistributedZk2Test, AutoScalingHandlerTest, 
ZkStateReaderTest, ChaosMonkeyNothingIsSafeTest, 
TestSubQueryTransformerCrossCore, TestSolrCloudWithDelegationTokens, 
TestLFUCache, CursorPagingTest, TestReloadDeadlock, TestSimpleTextCodec, 
SolrCoreMetricManagerTest, MetricsHandlerTest, TestFieldCacheReopen, 
TestEmbeddedSolrServerConstructors, SecurityConfHandlerTest, 
TestDefaultStatsCache, TestXmlQParser, JSONWriterTest, 
WordBreakSolrSpellCheckerTest, TestSolr4Spatial2, SaslZkACLProviderTest, 
TestTolerantUpdateProcessorRandomCloud, TestExclusionRuleCollectionAccess, 
TestManagedSchema, SolrCloudExampleTest, MetricUtilsTest, TestCoreAdminApis, 
DistributedFacetPivotLargeTest, SyncSliceTest, DocValuesNotIndexedTest, 
TestJettySolrRunner, TestFoldingMultitermQuery, 
TestFieldTypeCollectionResource, DeleteLastCustomShardedReplicaTest, 
TestCursorMarkWithoutUniqueKey, DefaultValueUpdateProcessorTest, 
TestExtendedDismaxParser, ShardRoutingTest, URLClassifyProcessorTest, 
PeerSyncTest, TestShortCircuitedRequests, CoreAdminCreateDiscoverTest, 
TestManagedSynonymGraphFilterFactory, TestPhraseSuggestions, SearchHandlerTest, 
SortByFunctionTest, TestReversedWildcardFilterFactory, 
TestFileDictionaryLookup, AnalysisErrorHandlingTest, HLLUtilTest, 
DeleteStatusTest, TestReplicationHandler, SimpleCollectionCreateDeleteTest, 
BasicDistributedZkTest, ChaosMonkeySafeLeaderTest, BasicDistributedZk2Test, 
UnloadDistributedZkTest, CollectionsAPIDistributedZkTest, 
OpenCloseCoreStressTest, OverseerTest, LeaderElectionIntegrationTest, 
BasicZkTest, RecoveryZkTest, TestRandomFaceting, TestZkChroot, TestFaceting, 
TestHashPartitioner, TermVectorComponentDistributedTest, ZkControllerTest, 
TestRealTimeGet, TestStressReorder, TestJoin, TestRangeQuery, 
StatsComponentTest, SpellCheckComponentTest, TestGroupingSearch, 
SolrCmdDistributorTest, QueryElevationComponentTest, BadIndexSchemaTest, 
TestLazyCores, DistributedQueryElevationComponentTest, SpellCheckCollatorTest, 
CoreAdminHandlerTest, DocValuesTest, TestRemoteStreaming, DebugComponentTest, 
IndexBasedSpellCheckerTest, DisMaxRequestHandlerTest, 
DocumentAnalysisRequestHandlerTest, TestOmitPositions, 
XmlUpdateRequestHandlerTest, DocumentBuilderTest, TestIndexingPerformance, 
RequiredFieldsTest, FastVectorHighlighterTest, IndexSchemaRuntimeFieldTest, 
SolrPluginUtilsTest, TestJmxIntegration, TestCSVResponseWriter, 
TestAnalyzedSuggestions, BinaryUpdateRequestHandlerTest, HighlighterConfigTest, 
SOLR749Test, TestQuerySenderListener, UpdateParamsTest, AlternateDirectoryTest, 
TestSolrIndexConfig, TestQuerySenderNoQuery, ResponseLogComponentTest, 
SolrIndexConfigTest, TestStressRecovery, TestSolrDeletionPolicy2, 
MultiTermTest, SampleTest, MinimalSchemaTest, TestFuzzyAnalyzedSuggestions, 
ExternalFileFieldSortTest, DirectSolrConnectionTest, TestCharFilters, 
TestXIncludeConfig, TestSweetSpotSimilarityFactory, 
TestLMDirichletSimilarityFactory, TimeZoneUtilsTest, TestFastOutputStream, 
OpenExchangeRatesOrgProviderTest, TestFastLRUCache, PreAnalyzedFieldTest, 
DateFieldTest, DOMUtilTest, TestLRUCache, CircularListTest, 
DistributedMLTComponentTest, TestHighlightDedupGrouping, TestTolerantSearch, 
ConnectionReuseTest, AliasIntegrationTest, 
ChaosMonkeyNothingIsSafeWithPullReplicasTest, CollectionsAPISolrJTest, 
ForceLeaderTest, LeaderFailureAfterFreshStartTest, 
LeaderInitiatedRecoveryOnCommitTest, OverseerRolesTest, OverseerTaskQueueTest, 
RemoteQueryErrorTest, ReplaceNodeTest, SSLMigrationTest, 
SharedFSAutoReplicaFailoverTest, SharedFSAutoReplicaFailoverUtilsTest, 
TestCloudInspectUtil, TestCloudPivotFacet, TestClusterProperties, 
TestCollectionAPI, TestConfigSetsAPIExclusivity, TestConfigSetsAPIZkFailure, 
TestDeleteCollectionOnDownNodes, TestDistribDocBasedVersion, 
TestDownShardTolerantSearch, TestLeaderElectionZkExpiry, 
TestOnReconnectListenerSupport, TestPullReplica, TestReplicaProperties, 
TestSSLRandomization, TestTlogReplica]
   [junit4] Completed [586/730 (2!)] on J0 in 108.88s, 13 tests, 1 failure <<< 
FAILURES!

[...truncated 44074 lines...]
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]

Reply via email to