Build: https://jenkins.thetaphi.de/job/Lucene-Solr-6.x-Windows/861/
Java: 64bit/jdk1.8.0_121 -XX:-UseCompressedOops -XX:+UseG1GC

4 tests failed.
FAILED:  junit.framework.TestSuite.org.apache.lucene.index.TestBagOfPostings

Error Message:
Could not remove the following files (in the order of attempts):    
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001\bagofpostings-001:
 java.nio.file.AccessDeniedException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001\bagofpostings-001
    
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001
 

Stack Trace:
java.io.IOException: Could not remove the following files (in the order of 
attempts):
   
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001\bagofpostings-001:
 java.nio.file.AccessDeniedException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001\bagofpostings-001
   
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001

        at __randomizedtesting.SeedInfo.seed([184350056BC96B4B]: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:745)


FAILED:  org.apache.solr.cloud.MissingSegmentRecoveryTest.testLeaderRecovery

Error Message:
Expected a collection with one shard and two replicas null Last available 
state: 
DocCollection(MissingSegmentRecoveryTest//collections/MissingSegmentRecoveryTest/state.json/7)={
   "replicationFactor":"2",   "shards":{"shard1":{       
"range":"80000000-7fffffff",       "state":"active",       "replicas":{         
"core_node1":{           "core":"MissingSegmentRecoveryTest_shard1_replica1",   
        "base_url":"https://127.0.0.1:50221/solr";,           
"node_name":"127.0.0.1:50221_solr",           "state":"active",           
"leader":"true"},         "core_node2":{           
"core":"MissingSegmentRecoveryTest_shard1_replica2",           
"base_url":"https://127.0.0.1:50226/solr";,           
"node_name":"127.0.0.1:50226_solr",           "state":"down"}}}},   
"router":{"name":"compositeId"},   "maxShardsPerNode":"1",   
"autoAddReplicas":"false"}

Stack Trace:
java.lang.AssertionError: Expected a collection with one shard and two replicas
null
Last available state: 
DocCollection(MissingSegmentRecoveryTest//collections/MissingSegmentRecoveryTest/state.json/7)={
  "replicationFactor":"2",
  "shards":{"shard1":{
      "range":"80000000-7fffffff",
      "state":"active",
      "replicas":{
        "core_node1":{
          "core":"MissingSegmentRecoveryTest_shard1_replica1",
          "base_url":"https://127.0.0.1:50221/solr";,
          "node_name":"127.0.0.1:50221_solr",
          "state":"active",
          "leader":"true"},
        "core_node2":{
          "core":"MissingSegmentRecoveryTest_shard1_replica2",
          "base_url":"https://127.0.0.1:50226/solr";,
          "node_name":"127.0.0.1:50226_solr",
          "state":"down"}}}},
  "router":{"name":"compositeId"},
  "maxShardsPerNode":"1",
  "autoAddReplicas":"false"}
        at 
__randomizedtesting.SeedInfo.seed([B0A675409B087673:E0F3ED43C229C06E]:0)
        at org.junit.Assert.fail(Assert.java:93)
        at 
org.apache.solr.cloud.SolrCloudTestCase.waitForState(SolrCloudTestCase.java:265)
        at 
org.apache.solr.cloud.MissingSegmentRecoveryTest.testLeaderRecovery(MissingSegmentRecoveryTest.java:105)
        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:745)


FAILED:  org.apache.solr.handler.TestReplicationHandlerBackup.doTestBackup

Error Message:
Unexpected file read error while reading index. 
(resource=BufferedChecksumIndexInput(SimpleFSIndexInput(path="C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.TestReplicationHandlerBackup_B0A675409B087673-001\solr-instance-001\collection1\data\snapshot.xyxtbjly\segments_2")))

Stack Trace:
org.apache.lucene.index.CorruptIndexException: Unexpected file read error while 
reading index. 
(resource=BufferedChecksumIndexInput(SimpleFSIndexInput(path="C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.TestReplicationHandlerBackup_B0A675409B087673-001\solr-instance-001\collection1\data\snapshot.xyxtbjly\segments_2")))
        at 
__randomizedtesting.SeedInfo.seed([B0A675409B087673:F12D5525BCB6853C]:0)
        at 
org.apache.lucene.index.SegmentInfos.readCommit(SegmentInfos.java:290)
        at 
org.apache.lucene.index.StandardDirectoryReader$1.doBody(StandardDirectoryReader.java:57)
        at 
org.apache.lucene.index.StandardDirectoryReader$1.doBody(StandardDirectoryReader.java:54)
        at 
org.apache.lucene.index.SegmentInfos$FindSegmentsFile.run(SegmentInfos.java:692)
        at 
org.apache.lucene.index.StandardDirectoryReader.open(StandardDirectoryReader.java:77)
        at org.apache.lucene.index.DirectoryReader.open(DirectoryReader.java:63)
        at 
org.apache.solr.handler.TestReplicationHandlerBackup.verify(TestReplicationHandlerBackup.java:150)
        at 
org.apache.solr.handler.TestReplicationHandlerBackup.doTestBackup(TestReplicationHandlerBackup.java:214)
        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:745)
Caused by: java.nio.file.NoSuchFileException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.TestReplicationHandlerBackup_B0A675409B087673-001\solr-instance-001\collection1\data\snapshot.xyxtbjly\_4.si
        at 
sun.nio.fs.WindowsException.translateToIOException(WindowsException.java:79)
        at 
sun.nio.fs.WindowsException.rethrowAsIOException(WindowsException.java:97)
        at 
sun.nio.fs.WindowsException.rethrowAsIOException(WindowsException.java:102)
        at 
sun.nio.fs.WindowsFileSystemProvider.newByteChannel(WindowsFileSystemProvider.java:230)
        at java.nio.file.Files.newByteChannel(Files.java:361)
        at java.nio.file.Files.newByteChannel(Files.java:407)
        at 
org.apache.lucene.store.SimpleFSDirectory.openInput(SimpleFSDirectory.java:77)
        at 
org.apache.lucene.store.Directory.openChecksumInput(Directory.java:137)
        at 
org.apache.lucene.codecs.lucene62.Lucene62SegmentInfoFormat.read(Lucene62SegmentInfoFormat.java:89)
        at 
org.apache.lucene.index.SegmentInfos.readCommit(SegmentInfos.java:357)
        at 
org.apache.lucene.index.SegmentInfos.readCommit(SegmentInfos.java:288)
        ... 46 more


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

Error Message:
Could not remove the following files (in the order of attempts):    
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core
    
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores
    
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002
    
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core\data:
 java.nio.file.AccessDeniedException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core\data
    
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001
 

Stack Trace:
java.io.IOException: Could not remove the following files (in the order of 
attempts):
   
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core
   
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores
   
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002
   
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core\data:
 java.nio.file.AccessDeniedException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core\data
   
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001

        at __randomizedtesting.SeedInfo.seed([B0A675409B087673]: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:745)




Build Log:
[...truncated 239 lines...]
   [junit4] Suite: org.apache.lucene.index.TestBagOfPostings
   [junit4]   2> NOTE: test params are: codec=Asserting(Lucene62): 
{field=PostingsFormat(name=LuceneVarGapDocFreqInterval)}, docValues:{}, 
maxPointsInLeafNode=230, maxMBSortInHeap=7.083657898946468, 
sim=RandomSimilarity(queryNorm=false,coord=no): {field=DFR I(F)Z(0.3)}, 
locale=vi-VN, timezone=Pacific/Fakaofo
   [junit4]   2> NOTE: Windows 10 10.0 amd64/Oracle Corporation 1.8.0_121 
(64-bit)/cpus=3,threads=1,free=77236736,total=214958080
   [junit4]   2> NOTE: All tests run in this JVM: [TestIndexWriter, 
TestNativeFSLockFactory, TestAttributeSource, TestDocBoost, TestBagOfPostings]
   [junit4]   2> NOTE: reproduce with: ant test  -Dtestcase=TestBagOfPostings 
-Dtests.seed=184350056BC96B4B -Dtests.slow=true -Dtests.locale=vi-VN 
-Dtests.timezone=Pacific/Fakaofo -Dtests.asserts=true 
-Dtests.file.encoding=ISO-8859-1
   [junit4] ERROR   0.00s J0 | TestBagOfPostings (suite) <<<
   [junit4]    > Throwable #1: java.io.IOException: Could not remove the 
following files (in the order of attempts):
   [junit4]    >    
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001\bagofpostings-001:
 java.nio.file.AccessDeniedException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001\bagofpostings-001
   [junit4]    >    
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\lucene\build\core\test\J0\temp\lucene.index.TestBagOfPostings_184350056BC96B4B-001
   [junit4]    >        at 
__randomizedtesting.SeedInfo.seed([184350056BC96B4B]:0)
   [junit4]    >        at org.apache.lucene.util.IOUtils.rm(IOUtils.java:329)
   [junit4]    >        at java.lang.Thread.run(Thread.java:745)
   [junit4] Completed [10/456 (1!)] on J0 in 1.05s, 1 test, 1 error <<< 
FAILURES!

[...truncated 11462 lines...]
   [junit4] Suite: 
org.apache.solr.handler.component.DistributedDebugComponentTest
   [junit4]   2> Creating dataDir: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\init-core-data-001
   [junit4]   2> 632874 WARN  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=1 numCloses=1
   [junit4]   2> 632874 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.SolrTestCaseJ4 Using TrieFields
   [junit4]   2> 632880 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-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> 632917 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.SolrTestCaseJ4 ####initCore
   [junit4]   2> 632917 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.SolrTestCaseJ4 ####initCore end
   [junit4]   2> 632918 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.SolrTestCaseJ4 Writing core.properties file to 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core
   [junit4]   2> 632922 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.e.j.s.Server jetty-9.3.14.v20161028
   [junit4]   2> 632923 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@85ff152{/solr,null,AVAILABLE}
   [junit4]   2> 632928 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@352ca74c{HTTP/1.1,[http/1.1]}{127.0.0.1:60649}
   [junit4]   2> 632928 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.e.j.s.Server Started @637530ms
   [junit4]   2> 632928 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, 
hostPort=60649, 
configSetBaseDir=C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-001,
 
coreRootDirectory=C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores}
   [junit4]   2> 632929 ERROR 
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.s.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 632929 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 
6.6.0
   [junit4]   2> 632929 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone mode on 
port null
   [junit4]   2> 632929 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 632929 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-04-29T03:24:47.407Z
   [junit4]   2> 632929 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.c.SolrXmlConfig Loading container configuration from 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-001\solr.xml
   [junit4]   2> 632941 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params: 
socketTimeout=340000&connTimeout=45000&retry=true
   [junit4]   2> 633033 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores
   [junit4]   2> 633033 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 633105 WARN  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is 
deprecated, use <mergePolicyFactory> instead.
   [junit4]   2> 633110 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.6.0
   [junit4]   2> 633141 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 633254 WARN  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] default search field in schema 
is text. WARNING: Deprecated, please use 'df' on request instead.
   [junit4]   2> 633256 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
   [junit4]   2> 633265 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from configset 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-001\collection1,
 trusted=true
   [junit4]   2> 633266 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 633266 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-001\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\core\data\]
   [junit4]   2> 633266 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.c.JmxMonitoredMap JMX monitoring is enabled. Adding Solr 
mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBeanServer@31be76af
   [junit4]   2> 633267 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=13, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.0]
   [junit4]   2> 633393 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.u.UpdateHandler Using UpdateLog implementation: 
org.apache.solr.update.UpdateLog
   [junit4]   2> 633393 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= 
defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 
numVersionBuckets=65536
   [junit4]   2> 633408 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 633408 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 633409 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=14, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.17231688533085343]
   [junit4]   2> 633409 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@38c7443e[collection1] main]
   [junit4]   2> 633409 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 633418 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 633569 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 633570 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 633570 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 633570 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 633570 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 633571 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache 
for 4 transient cores
   [junit4]   2> 633571 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 633572 INFO  (coreLoadExecutor-2594-thread-1) [    
x:collection1] o.a.s.u.UpdateLog Could not find max version in index or recent 
updates, using new clock 1565981449178316800
   [junit4]   2> 633575 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 633577 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 633578 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 633579 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 633580 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@38c7443e[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 633747 INFO  
(SUITE-DistributedDebugComponentTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.SolrJettyTestBase Jetty Assigned Port#60649
   [junit4]   2> 633757 INFO  (qtp1629940962-5842) [    ] 
o.a.s.h.a.CoreAdminOperation core create command 
name=collection2&action=CREATE&configSet=collection1&wt=javabin&version=2
   [junit4]   2> 633796 WARN  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use 
<mergePolicyFactory> instead.
   [junit4]   2> 633798 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.6.0
   [junit4]   2> 633820 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.s.IndexSchema [collection2] Schema name=test
   [junit4]   2> 633952 WARN  (qtp1629940962-5842) [    x:collection2] 
o.a.s.s.IndexSchema [collection2] default search field in schema is text. 
WARNING: Deprecated, please use 'df' on request instead.
   [junit4]   2> 633955 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
   [junit4]   2> 633965 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.CoreContainer Creating SolrCore 'collection2' using configuration from 
configset 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-001\collection1,
 trusted=true
   [junit4]   2> 633965 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 633966 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.SolrCore [[collection2] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-001\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.handler.component.DistributedDebugComponentTest_B0A675409B087673-001\tempDir-002\cores\collection2\data\]
   [junit4]   2> 633966 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.JmxMonitoredMap JMX monitoring is enabled. Adding Solr mbeans to JMX 
Server: com.sun.jmx.mbeanserver.JmxMBeanServer@31be76af
   [junit4]   2> 633968 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=13, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.0]
   [junit4]   2> 634118 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.u.UpdateHandler Using UpdateLog implementation: 
org.apache.solr.update.UpdateLog
   [junit4]   2> 634118 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH 
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 634121 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 634121 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 634122 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=14, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.17231688533085343]
   [junit4]   2> 634124 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@481c5a67[collection2] main]
   [junit4]   2> 634124 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 634133 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.s.DirectSolrSpellChecker init: 
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
   [junit4]   2> 634172 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.h.ReplicationHandler Commits will be reserved for  10000
   [junit4]   2> 634173 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 634173 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct
   [junit4]   2> 634173 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak
   [junit4]   2> 634173 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: 
multipleFields
   [junit4]   2> 634173 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler
   [junit4]   2> 634175 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external
   [junit4]   2> 634176 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq
   [junit4]   2> 634176 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using 
new clock 1565981449811656704
   [junit4]   2> 634176 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn
   [junit4]   2> 634177 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict
   [junit4]   2> 634178 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.c.SolrCore [collection2] Registered new searcher 
Searcher@481c5a67[collection2] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 634179 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores 
params={name=collection2&action=CREATE&configSet=collection1&wt=javabin&version=2}
 status=0 QTime=422
   [junit4]   2> 634186 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[1 (1565981449816899584)]} 0 4
   [junit4]   2> 634188 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 634188 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.u.SolrIndexWriter Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@4031eaae
   [junit4]   2> 634194 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@5d26606f[collection1] main]
   [junit4]   2> 634195 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 634196 INFO  
(searcherExecutor-2595-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@5d26606f[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(6.6.0):c1)))}
   [junit4]   2> 634196 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 9
   [junit4]   2> 634202 INFO  (qtp1629940962-5845) [    x:collection2] 
o.a.s.u.p.LogUpdateProcessorFactory [collection2]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[2 (1565981449834725376)]} 0 4
   [junit4]   2> 634204 INFO  (qtp1629940962-5840) [    x:collection2] 
o.a.s.u.DirectUpdateHandler2 start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 634204 INFO  (qtp1629940962-5840) [    x:collection2] 
o.a.s.u.SolrIndexWriter Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@71d291dd
   [junit4]   2> 634223 INFO  (qtp1629940962-5840) [    x:collection2] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@3c208f08[collection2] main]
   [junit4]   2> 634223 INFO  (qtp1629940962-5840) [    x:collection2] 
o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 634224 INFO  
(searcherExecutor-2600-thread-1-processing-x:collection2) [    x:collection2] 
o.a.s.c.SolrCore [collection2] Registered new searcher 
Searcher@3c208f08[collection2] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(6.6.0):c1)))}
   [junit4]   2> 634225 INFO  (qtp1629940962-5840) [    x:collection2] 
o.a.s.u.p.LogUpdateProcessorFactory [collection2]  webapp=/solr path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 20
   [junit4]   2> 634232 INFO  
(TEST-DistributedDebugComponentTest.testSimpleSearch-seed#[B0A675409B087673]) [ 
   ] o.a.s.SolrTestCaseJ4 ###Starting testSimpleSearch
   [junit4]   2> 634238 INFO  (qtp1629940962-5844) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288711-40&rows=10&version=2&q=*:*&requestPurpose=GET_TOP_IDS&NOW=1493436288711&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634238 INFO  (qtp1629940962-5843) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288711-40&rows=10&version=2&q=*:*&requestPurpose=GET_TOP_IDS&NOW=1493436288711&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634240 INFO  (qtp1629940962-5845) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=track&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288711-40&version=2&q=*:*&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288711&ids=2&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 634240 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=track&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288711-40&version=2&q=*:*&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288711&ids=1&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 634240 INFO  (qtp1629940962-5842) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=*:*&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=track&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288711-40 hits=2 status=0 QTime=7
   [junit4]   2> 634243 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288720-41&rows=10&version=2&q=*:*&omitHeader=true&requestPurpose=GET_TOP_IDS&NOW=1493436288720&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634243 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288720-41&rows=10&version=2&q=*:*&omitHeader=true&requestPurpose=GET_TOP_IDS&NOW=1493436288720&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634246 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=track&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288720-41&version=2&q=*:*&omitHeader=true&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288720&ids=1&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 634246 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=track&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288720-41&version=2&q=*:*&omitHeader=true&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288720&ids=2&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 634247 INFO  (qtp1629940962-5840) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=*:*&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=track&omitHeader=true&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288720-41 hits=2 status=0 QTime=4
   [junit4]   2> 634250 INFO  (qtp1629940962-5847) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288727-42&rows=10&version=2&q=id:1&omitHeader=true&requestPurpose=GET_TOP_IDS&NOW=1493436288727&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634251 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288727-42&rows=10&version=2&q=id:1&omitHeader=true&requestPurpose=GET_TOP_IDS&NOW=1493436288727&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634252 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=track&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288727-42&version=2&q=id:1&omitHeader=true&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288727&ids=1&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 634252 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=track&omitHeader=true&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288727-42 hits=1 status=0 QTime=3
   [junit4]   2> 634252 INFO  
(TEST-DistributedDebugComponentTest.testSimpleSearch-seed#[B0A675409B087673]) [ 
   ] o.a.s.SolrTestCaseJ4 ###Ending testSimpleSearch
   [junit4]   2> 634262 INFO  
(TEST-DistributedDebugComponentTest.testCompareWithNonDistributedRequest-seed#[B0A675409B087673])
 [    ] o.a.s.SolrTestCaseJ4 ###Starting testCompareWithNonDistributedRequest
   [junit4]   2> 634270 INFO  (qtp1629940962-5840) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=true&debug=timing&debug=track&fl=id&shards.purpose=324&start=0&fsv=true&fq=id:[0+TO+10]&fq=id:[0+TO+5]&sort=id+asc&distrib.singlePass=false&shard.url=127.0.0.1:60649/solr/collection1&rows=1&rid=127.0.0.1-collection1-1493436288743-43&version=2&q=id:1+OR+id:2&requestPurpose=GET_TOP_IDS,GET_FIELDS,GET_DEBUG&NOW=1493436288743&isShard=true&wt=javabin&debugQuery=true}
 hits=1 status=0 QTime=1
   [junit4]   2> 634271 INFO  (qtp1629940962-5844) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=true&debug=timing&debug=track&fl=id&shards.purpose=324&start=0&fsv=true&fq=id:[0+TO+10]&fq=id:[0+TO+5]&sort=id+asc&distrib.singlePass=false&shard.url=127.0.0.1:60649/solr/collection2&rows=1&rid=127.0.0.1-collection1-1493436288743-43&version=2&q=id:1+OR+id:2&requestPurpose=GET_TOP_IDS,GET_FIELDS,GET_DEBUG&NOW=1493436288743&isShard=true&wt=javabin&debugQuery=true}
 hits=1 status=0 QTime=3
   [junit4]   2> 634271 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+id:2&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=true&fl=id&fq=id:[0+TO+10]&fq=id:[0+TO+5]&sort=id+asc&distrib.singlePass=false&rows=1&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288743-43 hits=2 status=0 QTime=7
   [junit4]   2> 634273 INFO  (qtp1629940962-5843) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+id:2&distrib=false&debug=true&fl=id&fq=id:[0+TO+10]&fq=id:[0+TO+5]&sort=id+asc&distrib.singlePass=false&rows=1&wt=javabin&version=2}
 hits=1 status=0 QTime=0
   [junit4]   2> 634274 INFO  
(TEST-DistributedDebugComponentTest.testCompareWithNonDistributedRequest-seed#[B0A675409B087673])
 [    ] o.a.s.SolrTestCaseJ4 ###Ending testCompareWithNonDistributedRequest
   [junit4]   2> 634281 INFO  
(TEST-DistributedDebugComponentTest.testDebugSections-seed#[B0A675409B087673]) 
[    ] o.a.s.SolrTestCaseJ4 ###Starting testDebugSections
   [junit4]   2> 634284 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288760-44&rows=10&version=2&q=text:_query_with_no_results_&requestPurpose=GET_TOP_IDS&NOW=1493436288760&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634284 INFO  (qtp1629940962-5845) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288760-44&rows=10&version=2&q=text:_query_with_no_results_&requestPurpose=GET_TOP_IDS&NOW=1493436288760&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634286 INFO  (qtp1629940962-5842) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=text:_query_with_no_results_&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&fl=id,text&wt=javabin&version=2&debugQuery=true}
 rid=127.0.0.1-collection1-1493436288760-44 hits=0 status=0 QTime=3
   [junit4]   2> 634289 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288765-45&rows=10&version=2&q=text:_query_with_no_results_&requestPurpose=GET_TOP_IDS&NOW=1493436288765&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634289 INFO  (qtp1629940962-5847) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288765-45&rows=10&version=2&q=text:_query_with_no_results_&requestPurpose=GET_TOP_IDS&NOW=1493436288765&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634290 INFO  (qtp1629940962-5840) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=text:_query_with_no_results_&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=true&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288765-45 hits=0 status=0 QTime=2
   [junit4]   2> 634293 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288769-46&rows=10&version=2&q=text:_query_with_no_results_&requestPurpose=GET_TOP_IDS&NOW=1493436288769&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634293 INFO  (qtp1629940962-5842) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288769-46&rows=10&version=2&q=text:_query_with_no_results_&requestPurpose=GET_TOP_IDS&NOW=1493436288769&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634293 INFO  (qtp1629940962-5843) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=text:_query_with_no_results_&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=track&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288769-46 hits=0 status=0 QTime=2
   [junit4]   2> 634296 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=text:_query_with_no_results_&NOW=1493436288773&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634296 INFO  (qtp1629940962-5847) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=text:_query_with_no_results_&NOW=1493436288773&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634296 INFO  (qtp1629940962-5845) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=text:_query_with_no_results_&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=query&fl=id,text&wt=javabin&version=2}
 hits=0 status=0 QTime=1
   [junit4]   2> 634300 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=text:_query_with_no_results_&NOW=1493436288776&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634300 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=text:_query_with_no_results_&NOW=1493436288776&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634301 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=text:_query_with_no_results_&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=results&fl=id,text&wt=javabin&version=2}
 hits=0 status=0 QTime=2
   [junit4]   2> 634304 INFO  (qtp1629940962-5843) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=text:_query_with_no_results_&NOW=1493436288780&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634305 INFO  (qtp1629940962-5843) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=text:_query_with_no_results_&NOW=1493436288780&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634305 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=text:_query_with_no_results_&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=timing&fl=id,text&wt=javabin&version=2}
 hits=0 status=0 QTime=3
   [junit4]   2> 634309 INFO  (qtp1629940962-5847) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=text:_query_with_no_results_&NOW=1493436288784&isShard=true&wt=javabin}
 hits=0 status=0 QTime=0
   [junit4]   2> 634309 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=text:_query_with_no_results_&NOW=1493436288784&isShard=true&wt=javabin}
 hits=0 status=0 QTime=0
   [junit4]   2> 634310 INFO  (qtp1629940962-5843) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=text:_query_with_no_results_&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=false&fl=id,text&wt=javabin&version=2}
 hits=0 status=0 QTime=3
   [junit4]   2> 634315 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288789-47&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_TOP_IDS&NOW=1493436288789&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=1
   [junit4]   2> 634316 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288789-47&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_TOP_IDS&NOW=1493436288789&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=1
   [junit4]   2> 634318 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=timing&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288789-47&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288789&ids=2&isShard=true&wt=javabin&debugQuery=true}
 status=0 QTime=0
   [junit4]   2> 634319 INFO  (qtp1629940962-5840) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=timing&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288789-47&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288789&ids=1&isShard=true&wt=javabin&debugQuery=true}
 status=0 QTime=0
   [junit4]   2> 634319 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&fl=id,text&wt=javabin&version=2&debugQuery=true}
 rid=127.0.0.1-collection1-1493436288789-47 hits=2 status=0 QTime=8
   [junit4]   2> 634322 INFO  (qtp1629940962-5843) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288799-48&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_TOP_IDS&NOW=1493436288799&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634322 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288799-48&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_TOP_IDS&NOW=1493436288799&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634324 INFO  (qtp1629940962-5845) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=true&debug=timing&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288799-48&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288799&ids=2&isShard=true&wt=javabin&debugQuery=true}
 status=0 QTime=0
   [junit4]   2> 634324 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=true&debug=timing&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288799-48&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288799&ids=1&isShard=true&wt=javabin&debugQuery=true}
 status=0 QTime=0
   [junit4]   2> 634325 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=true&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288799-48 hits=2 status=0 QTime=3
   [junit4]   2> 634328 INFO  (qtp1629940962-5847) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288804-49&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_TOP_IDS&NOW=1493436288804&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634328 INFO  (qtp1629940962-5843) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288804-49&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_TOP_IDS&NOW=1493436288804&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634329 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=track&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288804-49&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288804&ids=1&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 634330 INFO  (qtp1629940962-5847) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=track&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288804-49&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288804&ids=2&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 634330 INFO  (qtp1629940962-5845) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=track&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288804-49 hits=2 status=0 QTime=4
   [junit4]   2> 634333 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&NOW=1493436288810&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634333 INFO  (qtp1629940962-5844) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&NOW=1493436288810&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634335 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&distrib=false&debug=query&debug=query&fl=id,text&shards.purpose=320&NOW=1493436288810&ids=2&isShard=true&shard.url=127.0.0.1:60649/solr/collection2&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634335 INFO  (qtp1629940962-5843) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&distrib=false&debug=query&debug=query&fl=id,text&shards.purpose=320&NOW=1493436288810&ids=1&isShard=true&shard.url=127.0.0.1:60649/solr/collection1&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634335 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=query&fl=id,text&wt=javabin&version=2}
 hits=2 status=0 QTime=4
   [junit4]   2> 634339 INFO  (qtp1629940962-5845) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&NOW=1493436288816&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634339 INFO  (qtp1629940962-5846) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&NOW=1493436288816&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634341 INFO  (qtp1629940962-5845) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&distrib=false&debug=results&debug=results&fl=id,text&shards.purpose=320&NOW=1493436288816&ids=1&isShard=true&shard.url=127.0.0.1:60649/solr/collection1&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634341 INFO  (qtp1629940962-5843) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&distrib=false&debug=results&debug=results&fl=id,text&shards.purpose=320&NOW=1493436288816&ids=2&isShard=true&shard.url=127.0.0.1:60649/solr/collection2&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634342 INFO  (qtp1629940962-5840) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=results&fl=id,text&wt=javabin&version=2}
 hits=2 status=0 QTime=3
   [junit4]   2> 634344 INFO  (qtp1629940962-5847) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&NOW=1493436288821&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634344 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&NOW=1493436288821&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634346 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&distrib=false&debug=timing&debug=timing&fl=id,text&shards.purpose=320&NOW=1493436288821&ids=1&isShard=true&shard.url=127.0.0.1:60649/solr/collection1&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634346 INFO  (qtp1629940962-5843) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&distrib=false&debug=timing&debug=timing&fl=id,text&shards.purpose=320&NOW=1493436288821&ids=2&isShard=true&shard.url=127.0.0.1:60649/solr/collection2&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634347 INFO  (qtp1629940962-5845) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=timing&fl=id,text&wt=javabin&version=2}
 hits=2 status=0 QTime=3
   [junit4]   2> 634349 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&NOW=1493436288826&isShard=true&wt=javabin}
 hits=1 status=0 QTime=0
   [junit4]   2> 634350 INFO  (qtp1629940962-5840) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&NOW=1493436288826&isShard=true&wt=javabin}
 hits=1 status=0 QTime=0
   [junit4]   2> 634351 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&distrib=false&debug=false&fl=id,text&shards.purpose=64&NOW=1493436288826&ids=1&isShard=true&shard.url=127.0.0.1:60649/solr/collection1&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634351 INFO  (qtp1629940962-5844) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&distrib=false&debug=false&fl=id,text&shards.purpose=64&NOW=1493436288826&ids=2&isShard=true&shard.url=127.0.0.1:60649/solr/collection2&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634352 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=id:1+OR+text:_query_with_no_results_+OR+id:[0+TO+300]&shards=127.0.0.1:60649/solr/collection1,127.0.0.1:60649/solr/collection2&distrib=true&debug=false&fl=id,text&wt=javabin&version=2}
 hits=2 status=0 QTime=4
   [junit4]   2> 634352 INFO  
(TEST-DistributedDebugComponentTest.testDebugSections-seed#[B0A675409B087673]) 
[    ] o.a.s.SolrTestCaseJ4 ###Ending testDebugSections
   [junit4]   2> 634360 INFO  
(TEST-DistributedDebugComponentTest.testRandom-seed#[B0A675409B087673]) [    ] 
o.a.s.SolrTestCaseJ4 ###Starting testRandom
   [junit4]   2> 634379 INFO  (qtp1629940962-5842) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=_query_with_no_results_+OR+batman&NOW=1493436288855&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634381 INFO  (qtp1629940962-5845) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman&distrib=false&debug=timing&debug=query&debug=results&debug=query&debug=results&debug=timing&fl=id,text&shards.purpose=320&NOW=1493436288855&ids=1&isShard=true&shard.url=127.0.0.1:60649/solr/collection1&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634382 INFO  (qtp1629940962-5843) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman&shards=127.0.0.1:60649/solr/collection1&distrib=true&debug=timing&debug=query&debug=results&fl=id,text&wt=javabin&version=2}
 hits=1 status=0 QTime=4
   [junit4]   2> 634384 INFO  (qtp1629940962-5840) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=_query_with_no_results_+OR+batman&NOW=1493436288861&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634385 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman&distrib=false&debug=timing&debug=results&debug=results&debug=timing&fl=id,text&shards.purpose=320&NOW=1493436288861&ids=1&isShard=true&shard.url=127.0.0.1:60649/solr/collection1&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634385 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman&shards=127.0.0.1:60649/solr/collection1&distrib=true&debug=timing&debug=results&fl=id,text&wt=javabin&version=2}
 hits=1 status=0 QTime=2
   [junit4]   2> 634389 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288866-50&rows=10&version=2&q=_query_with_no_results_+OR+batman&requestPurpose=GET_TOP_IDS&NOW=1493436288866&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634389 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman&shards=127.0.0.1:60649/solr/collection2&distrib=true&debug=results&debug=track&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288866-50 hits=0 status=0 QTime=1
   [junit4]   2> 634392 INFO  (qtp1629940962-5843) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=_query_with_no_results_+OR+batman+OR+superman&NOW=1493436288869&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634392 INFO  (qtp1629940962-5840) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=_query_with_no_results_+OR+batman+OR+superman&NOW=1493436288869&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634394 INFO  (qtp1629940962-5843) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman+OR+superman&distrib=false&debug=timing&debug=query&debug=query&debug=timing&fl=id,text&shards.purpose=320&NOW=1493436288869&ids=1&isShard=true&shard.url=127.0.0.1:60649/solr/collection1&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634394 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman+OR+superman&distrib=false&debug=timing&debug=query&debug=query&debug=timing&fl=id,text&shards.purpose=320&NOW=1493436288869&ids=2&isShard=true&shard.url=127.0.0.1:60649/solr/collection2&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634395 INFO  (qtp1629940962-5845) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman+OR+superman&shards=127.0.0.1:60649/solr/collection2,127.0.0.1:60649/solr/collection1&distrib=true&debug=timing&debug=query&fl=id,text&wt=javabin&version=2}
 hits=2 status=0 QTime=3
   [junit4]   2> 634397 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=_query_with_no_results_+OR+superman&NOW=1493436288874&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634397 INFO  (qtp1629940962-5844) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=_query_with_no_results_+OR+superman&NOW=1493436288874&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634399 INFO  (qtp1629940962-5847) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+superman&distrib=false&debug=timing&debug=query&debug=results&debug=query&debug=results&debug=timing&fl=id,text&shards.purpose=320&NOW=1493436288874&ids=2&isShard=true&shard.url=127.0.0.1:60649/solr/collection2&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634399 INFO  (qtp1629940962-5843) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+superman&shards=127.0.0.1:60649/solr/collection2,127.0.0.1:60649/solr/collection1&distrib=true&debug=timing&debug=query&debug=results&fl=id,text&wt=javabin&version=2}
 hits=1 status=0 QTime=3
   [junit4]   2> 634402 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection2-1493436288879-51&rows=10&version=2&q=_query_with_no_results_+OR+batman+OR+superman&requestPurpose=GET_TOP_IDS&NOW=1493436288879&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634405 INFO  (qtp1629940962-5845) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=timing&debug=results&debug=track&debug=results&debug=timing&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection2-1493436288879-51&version=2&q=_query_with_no_results_+OR+batman+OR+superman&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288879&ids=2&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 634405 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman+OR+superman&shards=127.0.0.1:60649/solr/collection2&distrib=true&debug=timing&debug=results&debug=track&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection2-1493436288879-51 hits=1 status=0 QTime=3
   [junit4]   2> 634408 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288885-52&rows=10&version=2&q=_query_with_no_results_+OR+batman+OR+superman&requestPurpose=GET_TOP_IDS&NOW=1493436288885&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634409 INFO  (qtp1629940962-5847) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=timing&debug=query&debug=track&debug=query&debug=timing&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288885-52&version=2&q=_query_with_no_results_+OR+batman+OR+superman&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288885&ids=1&isShard=true&wt=javabin}
 status=0 QTime=0
   [junit4]   2> 634409 INFO  (qtp1629940962-5840) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman+OR+superman&shards=127.0.0.1:60649/solr/collection1&distrib=true&debug=timing&debug=query&debug=track&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection1-1493436288885-52 hits=1 status=0 QTime=2
   [junit4]   2> 634412 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection2-1493436288889-53&rows=10&version=2&q=_query_with_no_results_&requestPurpose=GET_TOP_IDS&NOW=1493436288889&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634412 INFO  (qtp1629940962-5843) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=_query_with_no_results_&shards=127.0.0.1:60649/solr/collection2&distrib=true&debug=timing&debug=results&debug=track&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection2-1493436288889-53 hits=0 status=0 QTime=1
   [junit4]   2> 634415 INFO  (qtp1629940962-5842) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rows=10&version=2&q=_query_with_no_results_+OR+batman&NOW=1493436288892&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634415 INFO  (qtp1629940962-5844) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rows=10&version=2&q=_query_with_no_results_+OR+batman&NOW=1493436288892&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634416 INFO  (qtp1629940962-5842) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman&distrib=false&debug=timing&debug=timing&fl=id,text&shards.purpose=320&NOW=1493436288892&ids=1&isShard=true&shard.url=127.0.0.1:60649/solr/collection1&wt=javabin&version=2}
 status=0 QTime=0
   [junit4]   2> 634416 INFO  (qtp1629940962-5845) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=_query_with_no_results_+OR+batman&shards=127.0.0.1:60649/solr/collection2,127.0.0.1:60649/solr/collection1&distrib=true&debug=timing&fl=id,text&wt=javabin&version=2}
 hits=1 status=0 QTime=2
   [junit4]   2> 634419 INFO  (qtp1629940962-5846) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection2-1493436288896-54&rows=10&version=2&q=_query_with_no_results_&requestPurpose=GET_TOP_IDS&NOW=1493436288896&isShard=true&wt=javabin&debugQuery=false}
 hits=0 status=0 QTime=0
   [junit4]   2> 634419 INFO  (qtp1629940962-5840) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={q=_query_with_no_results_&shards=127.0.0.1:60649/solr/collection2&distrib=true&debug=query&debug=track&fl=id,text&wt=javabin&version=2}
 rid=127.0.0.1-collection2-1493436288896-54 hits=0 status=0 QTime=1
   [junit4]   2> 634422 INFO  (qtp1629940962-5847) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288899-55&rows=10&version=2&q=_query_with_no_results_+OR+batman+OR+superman&requestPurpose=GET_TOP_IDS&NOW=1493436288899&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634422 INFO  (qtp1629940962-5844) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={distrib=false&debug=false&debug=timing&debug=track&fl=id&fl=score&shards.purpose=4&start=0&fsv=true&shard.url=127.0.0.1:60649/solr/collection1&rid=127.0.0.1-collection1-1493436288899-55&rows=10&version=2&q=_query_with_no_results_+OR+batman+OR+superman&requestPurpose=GET_TOP_IDS&NOW=1493436288899&isShard=true&wt=javabin&debugQuery=false}
 hits=1 status=0 QTime=0
   [junit4]   2> 634424 INFO  (qtp1629940962-5842) [    x:collection2] 
o.a.s.c.S.Request [collection2]  webapp=/solr path=/select 
params={distrib=false&debug=timing&debug=results&debug=track&debug=results&debug=timing&debug=track&fl=id,text&shards.purpose=320&shard.url=127.0.0.1:60649/solr/collection2&rid=127.0.0.1-collection1-1493436288899-55&version=2&q=_query_with_no_results_+OR+batman+OR+superman&requestPurpose=GET_FIELDS,GET_DEBUG&NOW=1493436288899&ids=2&isShard=true&wt=javabin}
 stat

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

   "base_url":"https://127.0.0.1:50221/solr";,
   [junit4]    >           "node_name":"127.0.0.1:50221_solr",
   [junit4]    >           "state":"active",
   [junit4]    >           "leader":"true"},
   [junit4]    >         "core_node2":{
   [junit4]    >           "core":"MissingSegmentRecoveryTest_shard1_replica2",
   [junit4]    >           "base_url":"https://127.0.0.1:50226/solr";,
   [junit4]    >           "node_name":"127.0.0.1:50226_solr",
   [junit4]    >           "state":"down"}}}},
   [junit4]    >   "router":{"name":"compositeId"},
   [junit4]    >   "maxShardsPerNode":"1",
   [junit4]    >   "autoAddReplicas":"false"}
   [junit4]    >        at 
__randomizedtesting.SeedInfo.seed([B0A675409B087673:E0F3ED43C229C06E]:0)
   [junit4]    >        at 
org.apache.solr.cloud.SolrCloudTestCase.waitForState(SolrCloudTestCase.java:265)
   [junit4]    >        at 
org.apache.solr.cloud.MissingSegmentRecoveryTest.testLeaderRecovery(MissingSegmentRecoveryTest.java:105)
   [junit4]    >        at java.lang.Thread.run(Thread.java:745)
   [junit4]   2> 1286058 WARN  (NIOServerCxn.Factory:0.0.0.0/0.0.0.0:0) [    ] 
o.a.z.s.NIOServerCnxn caught end of stream exception
   [junit4]   2> EndOfStreamException: Unable to read additional data from 
client sessionid 0x15bb7c5c6e50008, likely client has closed socket
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxn.doIO(NIOServerCnxn.java:239)
   [junit4]   2>        at 
org.apache.zookeeper.server.NIOServerCnxnFactory.run(NIOServerCnxnFactory.java:203)
   [junit4]   2>        at java.lang.Thread.run(Thread.java:745)
   [junit4]   2> 1286063 INFO  (jetty-closer-2948-thread-1) [    ] 
o.e.j.s.AbstractConnector Stopped ServerConnector@693439e0{SSL,[ssl, 
http/1.1]}{127.0.0.1:0}
   [junit4]   2> 1286065 INFO  (jetty-closer-2948-thread-1) [    ] 
o.a.s.c.CoreContainer Shutting down CoreContainer instance=1968577032
   [junit4]   2> 1286068 INFO  (jetty-closer-2948-thread-2) [    ] 
o.e.j.s.AbstractConnector Stopped ServerConnector@2b80f28a{SSL,[ssl, 
http/1.1]}{127.0.0.1:50226}
   [junit4]   2> 1286069 INFO  (jetty-closer-2948-thread-2) [    ] 
o.a.s.c.CoreContainer Shutting down CoreContainer instance=1768792094
   [junit4]   2> 1286076 INFO  (jetty-closer-2948-thread-1) [    ] 
o.a.s.c.Overseer Overseer 
(id=97873876991934470-127.0.0.1:50221_solr-n_0000000000) closing
   [junit4]   2> 1286077 INFO  
(OverseerStateUpdate-97873876991934470-127.0.0.1:50221_solr-n_0000000000) 
[n:127.0.0.1:50221_solr    ] o.a.s.c.Overseer Overseer Loop exiting : 
127.0.0.1:50221_solr
   [junit4]   2> 1286088 WARN  
(zkCallback-2970-thread-2-processing-n:127.0.0.1:50226_solr) 
[n:127.0.0.1:50226_solr    ] o.a.s.c.c.ZkStateReader ZooKeeper watch triggered, 
but Solr cannot talk to ZK: [KeeperErrorCode = Session expired for /live_nodes]
   [junit4]   2> 1286089 INFO  (jetty-closer-2948-thread-2) [    ] 
o.a.s.m.SolrMetricManager Closing metric reporters for: solr.node
   [junit4]   2> 1286093 INFO  (jetty-closer-2948-thread-2) [    ] 
o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@4efe5984{/solr,null,UNAVAILABLE}
   [junit4]   2> 1286093 INFO  
(zkCallback-2959-thread-2-processing-n:127.0.0.1:50221_solr) 
[n:127.0.0.1:50221_solr    ] o.a.s.c.c.ZkStateReader Updated live nodes from 
ZooKeeper... (2) -> (1)
   [junit4]   2> 1286094 WARN  
(zkCallback-2959-thread-2-processing-n:127.0.0.1:50221_solr) 
[n:127.0.0.1:50221_solr    ] o.a.s.c.c.ZkStateReader ZooKeeper watch triggered, 
but Solr cannot talk to ZK: [KeeperErrorCode = Session expired for /live_nodes]
   [junit4]   2> 1286094 INFO  (jetty-closer-2948-thread-1) [    ] 
o.a.s.m.SolrMetricManager Closing metric reporters for: solr.node
   [junit4]   2> 1286099 INFO  (jetty-closer-2948-thread-1) [    ] 
o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@67ad7313{/solr,null,UNAVAILABLE}
   [junit4]   2> 1286102 ERROR 
(SUITE-MissingSegmentRecoveryTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.z.s.ZooKeeperServer ZKShutdownHandler is not registered, so ZooKeeper 
server won't take any action on ERROR or SHUTDOWN server state changes
   [junit4]   2> 1286102 INFO  
(SUITE-MissingSegmentRecoveryTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.c.ZkTestServer connecting to 127.0.0.1:50217 50217
   [junit4]   2> 1286105 INFO  (Thread-2310) [    ] o.a.s.c.ZkTestServer 
connecting to 127.0.0.1:50217 50217
   [junit4]   2> 1286106 WARN  (Thread-2310) [    ] o.a.s.c.ZkTestServer Watch 
limit violations: 
   [junit4]   2> Maximum concurrent create/delete watches above limit:
   [junit4]   2> 
   [junit4]   2>        4       /solr/aliases.json
   [junit4]   2>        3       /solr/security.json
   [junit4]   2>        2       /solr/configs/conf
   [junit4]   2> 
   [junit4]   2> Maximum concurrent data watches above limit:
   [junit4]   2> 
   [junit4]   2>        4       /solr/clusterstate.json
   [junit4]   2>        4       
/solr/collections/MissingSegmentRecoveryTest/state.json
   [junit4]   2>        4       /solr/clusterprops.json
   [junit4]   2>        2       
/solr/overseer_elect/election/97873876991934470-127.0.0.1:50221_solr-n_0000000000
   [junit4]   2> 
   [junit4]   2> Maximum concurrent children watches above limit:
   [junit4]   2> 
   [junit4]   2>        4       /solr/collections
   [junit4]   2>        3       /solr/live_nodes
   [junit4]   2> 
   [junit4]   2> 1286108 INFO  
(SUITE-MissingSegmentRecoveryTest-seed#[B0A675409B087673]-worker) [    ] 
o.a.s.SolrTestCaseJ4 ###deleteCore
   [junit4]   2> NOTE: leaving temporary files on disk at: 
C:\Users\jenkins\workspace\Lucene-Solr-6.x-Windows\solr\build\solr-core\test\J1\temp\solr.cloud.MissingSegmentRecoveryTest_B0A675409B087673-001
   [junit4]   2> Apr 29, 2017 3:35:40 AM 
com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
   [junit4]   2> WARNING: Will linger awaiting termination of 4 leaked 
thread(s).
   [junit4]   2> NOTE: test params are: codec=Asserting(Lucene62): 
{_version_=PostingsFormat(name=Memory doPackFST= true), 
id=PostingsFormat(name=LuceneVarGapFixedInterval)}, docValues:{}, 
maxPointsInLeafNode=1170, maxMBSortInHeap=5.422920623357066, 
sim=RandomSimilarity(queryNorm=true,coord=yes): {}, locale=ar-LY, 
timezone=America/Aruba
   [junit4]   2> NOTE: Windows 10 10.0 amd64/Oracle Corporation 1.8.0_121 
(64-bit)/cpus=3,threads=1,free=266070072,total=536870912
   [junit4]   2> NOTE: All tests run in this JVM: [TestRecovery, 
TestApiFramework, DistributedIntervalFacetingTest, CdcrReplicationHandlerTest, 
TestNoOpRegenerator, TestWriterPerf, SolrJmxReporterTest, 
TestClassNameShortening, BasicAuthStandaloneTest, 
BinaryUpdateRequestHandlerTest, BJQParserTest, TestManagedResource, 
CopyFieldTest, TestIndexSearcher, TestRecoveryHdfs, ConvertedLegacyTest, 
DistributedSuggestComponentTest, GraphQueryTest, TestDFRSimilarityFactory, 
URLClassifyProcessorTest, TestSizeLimitedDistributedMap, 
SolrGangliaReporterTest, ZkStateReaderTest, ClusterStateTest, SmileWriterTest, 
TestBackupRepositoryFactory, CSVRequestHandlerTest, SolrInfoMBeanTest, 
TestSolrCloudWithKerberosAlt, SolrCoreCheckLockOnStartupTest, 
HdfsCollectionsAPIDistributedZkTest, TestPivotHelperCode, 
TestDefaultSearchFieldResource, TestCoreDiscovery, HdfsThreadLeakTest, 
TestCryptoKeys, CollectionTooManyReplicasTest, CacheHeaderTest, TestJsonFacets, 
CloudMLTQParserTest, BasicFunctionalityTest, TestDocSet, HighlighterConfigTest, 
BlockJoinFacetRandomTest, ParsingFieldUpdateProcessorsTest, SearchHandlerTest, 
TestConfigsApi, ConfigureRecoveryStrategyTest, MBeansHandlerTest, 
TestSolrCloudSnapshots, WordBreakSolrSpellCheckerTest, TestFieldTypeResource, 
TestSolrConfigHandlerConcurrent, LeaderElectionContextKeyTest, 
TestManagedSynonymFilterFactory, JsonValidatorTest, TestSolrDynamicMBean, 
UpdateLogTest, BasicDistributedZk2Test, UUIDUpdateProcessorFallbackTest, 
TestLuceneMatchVersion, CleanupOldIndexTest, TestFastWriter, 
RAMDirectoryFactoryTest, TestLeaderElectionWithEmptyReplica, 
TestSolrCoreParser, TestRequestStatusCollectionAPI, SortByFunctionTest, 
TestIndexingPerformance, TestFieldResource, TestAuthorizationFramework, 
CreateCollectionCleanupTest, TestConfig, 
TestPerFieldSimilarityWithDefaultOverride, HdfsUnloadDistributedZkTest, 
CdcrBootstrapTest, RestartWhileUpdatingTest, IndexSchemaTest, TestRealTimeGet, 
TestOrdValues, TestSQLHandlerNonCloud, LoggingHandlerTest, 
DistributedDebugComponentTest, TestCollapseQParserPlugin, 
TestReplicationHandlerBackup, TestBlendedInfixSuggestions, 
TestFuzzyAnalyzedSuggestions, AnalyticsMergeStrategyTest, CollectionReloadTest, 
QueryParsingTest, LeaderElectionIntegrationTest, HdfsRecoverLeaseTest, 
V2ApiIntegrationTest, TestUniqueKeyFieldResource, PreAnalyzedFieldTest, 
TestFoldingMultitermQuery, TestTrie, SharedFSAutoReplicaFailoverUtilsTest, 
DistribJoinFromCollectionTest, MinimalSchemaTest, TestCodecSupport, 
SortSpecParsingTest, SolrIndexSplitterTest, FullSolrCloudDistribCmdsTest, 
TestSolrCoreProperties, InfixSuggestersTest, TestSchemaVersionResource, 
TestConfigSets, CdcrVersionReplicationTest, TestStressLiveNodes, 
OverseerTaskQueueTest, ReplaceNodeTest, TestXmlQParserPlugin, TestJoin, 
TestRuleBasedAuthorizationPlugin, HdfsRestartWhileUpdatingTest, 
TestRestManager, TestLMDirichletSimilarityFactory, TestSolrQueryParser, 
ResourceLoaderTest, DocExpirationUpdateProcessorFactoryTest, BitVectorTest, 
SSLMigrationTest, TestReplicaProperties, TestSearcherReuse, ReturnFieldsTest, 
TestImplicitCoreProperties, DeleteNodeTest, BufferStoreTest, 
TestSolrCloudWithHadoopAuthPlugin, DistribCursorPagingTest, FullHLLTest, 
OpenCloseCoreStressTest, MergeStrategyTest, HdfsLockFactoryTest, 
AddSchemaFieldsUpdateProcessorFactoryTest, TestScoreJoinQPScore, 
TestSchemaManager, TestPushWriter, TriLevelCompositeIdRoutingTest, 
DateMathParserTest, TestCloudRecovery, HdfsChaosMonkeyNothingIsSafeTest, 
AutoCommitTest, DistributedFacetPivotLongTailTest, 
PropertiesRequestHandlerTest, TestNamedUpdateProcessors, 
TestComplexPhraseQParserPlugin, RequestLoggingTest, EnumFieldTest, 
MissingSegmentRecoveryTest]
   [junit4] Completed [311/708 (3!)] on J1 in 97.41s, 1 test, 1 failure <<< 
FAILURES!

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

Reply via email to