lucene-dev mailing list archives

Site index · List index
Message view « Date » · « Thread »
Top « Date » · « Thread »
From Policeman Jenkins Server <jenk...@thetaphi.de>
Subject [JENKINS] Lucene-Solr-7.x-MacOSX (64bit/jdk-9) - Build # 325 - Unstable!
Date Sun, 03 Dec 2017 17:25:53 GMT
Build: https://jenkins.thetaphi.de/job/Lucene-Solr-7.x-MacOSX/325/
Java: 64bit/jdk-9 -XX:-UseCompressedOops -XX:+UseSerialGC

3 tests failed.
FAILED:  org.apache.solr.core.TestLazyCores.testNoCommit

Error Message:
Exception during query

Stack Trace:
java.lang.RuntimeException: Exception during query
	at __randomizedtesting.SeedInfo.seed([5882D403B82F95B2:87E275D27308F617]:0)
	at org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:901)
	at org.apache.solr.core.TestLazyCores.check10(TestLazyCores.java:847)
	at org.apache.solr.core.TestLazyCores.testNoCommit(TestLazyCores.java:829)
	at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
	at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
	at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
	at java.base/java.lang.reflect.Method.invoke(Method.java:564)
	at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1737)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:934)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:970)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:984)
	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:943)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890)
	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 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.base/java.lang.Thread.run(Thread.java:844)
Caused by: java.lang.RuntimeException: REQUEST FAILED: xpath=//result[@numFound='10']
	xml response was: <?xml version="1.0" encoding="UTF-8"?>
<response>
<lst name="responseHeader"><int name="status">0</int><int name="QTime">1</int><lst name="params"><str name="q">*:*</str></lst></lst><result name="response" numFound="0" start="0"></result>
</response>

	request was:q=*:*
	at org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:894)
	... 40 more


FAILED:  junit.framework.TestSuite.org.apache.solr.core.TestLazyCores

Error Message:
1 thread leaked from SUITE scope at org.apache.solr.core.TestLazyCores:     1) Thread[id=17025, name=searcherExecutor-7356-thread-1, state=WAITING, group=TGRP-TestLazyCores]         at java.base@9/jdk.internal.misc.Unsafe.park(Native Method)         at java.base@9/java.util.concurrent.locks.LockSupport.park(LockSupport.java:194)         at java.base@9/java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2062)         at java.base@9/java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:435)         at java.base@9/java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1092)         at java.base@9/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1152)         at java.base@9/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:641)         at java.base@9/java.lang.Thread.run(Thread.java:844)

Stack Trace:
com.carrotsearch.randomizedtesting.ThreadLeakError: 1 thread leaked from SUITE scope at org.apache.solr.core.TestLazyCores: 
   1) Thread[id=17025, name=searcherExecutor-7356-thread-1, state=WAITING, group=TGRP-TestLazyCores]
        at java.base@9/jdk.internal.misc.Unsafe.park(Native Method)
        at java.base@9/java.util.concurrent.locks.LockSupport.park(LockSupport.java:194)
        at java.base@9/java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2062)
        at java.base@9/java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:435)
        at java.base@9/java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1092)
        at java.base@9/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1152)
        at java.base@9/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:641)
        at java.base@9/java.lang.Thread.run(Thread.java:844)
	at __randomizedtesting.SeedInfo.seed([5882D403B82F95B2]:0)


FAILED:  junit.framework.TestSuite.org.apache.solr.core.TestLazyCores

Error Message:
There are still zombie threads that couldn't be terminated:    1) Thread[id=17025, name=searcherExecutor-7356-thread-1, state=WAITING, group=TGRP-TestLazyCores]         at java.base@9/jdk.internal.misc.Unsafe.park(Native Method)         at java.base@9/java.util.concurrent.locks.LockSupport.park(LockSupport.java:194)         at java.base@9/java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2062)         at java.base@9/java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:435)         at java.base@9/java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1092)         at java.base@9/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1152)         at java.base@9/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:641)         at java.base@9/java.lang.Thread.run(Thread.java:844)

Stack Trace:
com.carrotsearch.randomizedtesting.ThreadLeakError: There are still zombie threads that couldn't be terminated:
   1) Thread[id=17025, name=searcherExecutor-7356-thread-1, state=WAITING, group=TGRP-TestLazyCores]
        at java.base@9/jdk.internal.misc.Unsafe.park(Native Method)
        at java.base@9/java.util.concurrent.locks.LockSupport.park(LockSupport.java:194)
        at java.base@9/java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2062)
        at java.base@9/java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:435)
        at java.base@9/java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1092)
        at java.base@9/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1152)
        at java.base@9/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:641)
        at java.base@9/java.lang.Thread.run(Thread.java:844)
	at __randomizedtesting.SeedInfo.seed([5882D403B82F95B2]:0)




Build Log:
[...truncated 12933 lines...]
   [junit4] Suite: org.apache.solr.core.TestLazyCores
   [junit4]   2> Creating dataDir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/init-core-data-001
   [junit4]   2> 1833383 WARN  (SUITE-TestLazyCores-seed#[5882D403B82F95B2]-worker) [    ] o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=39 numCloses=39
   [junit4]   2> 1833383 INFO  (SUITE-TestLazyCores-seed#[5882D403B82F95B2]-worker) [    ] o.a.s.SolrTestCaseJ4 Using TrieFields (NUMERIC_POINTS_SYSPROP=false) w/NUMERIC_DOCVALUES_SYSPROP=true
   [junit4]   2> 1833384 INFO  (SUITE-TestLazyCores-seed#[5882D403B82F95B2]-worker) [    ] o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (false) via: @org.apache.solr.util.RandomizeSSL(reason="", value=0.0/0.0, ssl=0.0/0.0, clientAuth=0.0/0.0) w/ MAC_OS_X supressed clientAuth
   [junit4]   2> 1833384 INFO  (SUITE-TestLazyCores-seed#[5882D403B82F95B2]-worker) [    ] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
   [junit4]   2> 1833385 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.SolrTestCaseJ4 ###Starting testMidUseUnload
   [junit4]   2> 1833414 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Loading container configuration from /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/solr.xml
   [junit4]   2> 1833416 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay is ignored
   [junit4]   2> 1833416 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 1833417 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb, but no JMX reporters were configured - adding default JMX reporter.
   [junit4]   2> 1833449 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1833471 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1833471 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1833473 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 transient cores
   [junit4]   2> 1833478 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1833479 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1833482 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1833485 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.s.IndexSchema [collection2] Schema name=tiny
   [junit4]   2> 1833514 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.s.IndexSchema [collection1] Schema name=tiny
   [junit4]   2> 1833515 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1833515 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection2' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/./collection2, trusted=true
   [junit4]   2> 1833515 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection2' (registry 'solr.core.collection2') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1833515 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1833515 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.c.SolrCore [[collection2] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/collection2], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/./collection2/data/]
   [junit4]   2> 1833516 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.s.IndexSchema [collection5] Schema name=tiny
   [junit4]   2> 1833518 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1833518 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/./collection1, trusted=true
   [junit4]   2> 1833519 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1833519 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1833519 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1833519 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/collection1], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/./collection1/data/]
   [junit4]   2> 1833521 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1833521 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection5' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/./collection5, trusted=true
   [junit4]   2> 1833521 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection5' (registry 'solr.core.collection5') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1833521 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1833521 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.c.SolrCore [[collection5] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/collection5], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/./collection5/data/]
   [junit4]   2> 1833522 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1833528 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1833619 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1833619 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1833621 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1833622 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1833622 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1833623 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1833624 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1833624 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1833625 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1833626 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@527af741[collection1] main]
   [junit4]   2> 1833626 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/collection1/conf
   [junit4]   2> 1833627 INFO  (coreLoadExecutor-7254-thread-1) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1833628 INFO  (searcherExecutor-7256-thread-1) [    ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@527af741[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1833628 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@18ff55e0[collection2] main]
   [junit4]   2> 1833629 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/collection2/conf
   [junit4]   2> 1833629 INFO  (coreLoadExecutor-7254-thread-2) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1833630 INFO  (searcherExecutor-7255-thread-1) [    ] o.a.s.c.SolrCore [collection2] Registered new searcher Searcher@18ff55e0[collection2] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1833630 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@1a0c8f75[collection5] main]
   [junit4]   2> 1833631 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-001/collection5/conf
   [junit4]   2> 1833631 INFO  (coreLoadExecutor-7254-thread-3) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1833632 INFO  (searcherExecutor-7257-thread-1) [    ] o.a.s.c.SolrCore [collection5] Registered new searcher Searcher@1a0c8f75[collection5] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1833636 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection1, tag=null
   [junit4]   2> 1833637 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@4743491e: rootName = null, domain = solr.core.collection1, service url = null, agent id = null] for registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@2487bf2e
   [junit4]   2> 1833649 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again.
   [junit4]   2> 1833751 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again.
   [junit4]   2> 1833854 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again.
   [junit4]   2> 1833961 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again.
   [junit4]   2> 1834071 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again.
   [junit4]   2> 1834181 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again.
   [junit4]   2> 1834274 INFO  (Thread-3383) [    ] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore org.apache.solr.core.SolrCore@61881de8
   [junit4]   2> 1834274 INFO  (Thread-3383) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection1, tag=1636310504
   [junit4]   2> 1834282 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=697510891
   [junit4]   2> 1834283 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null
   [junit4]   2> 1834283 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@4285311e: rootName = null, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@2da8f0cd
   [junit4]   2> 1834289 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null
   [junit4]   2> 1834289 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@6a786fdc: rootName = null, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@5c219403
   [junit4]   2> 1834293 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null
   [junit4]   2> 1834293 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@3b1c98ed: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@4cfa726c
   [junit4]   2> 1834294 INFO  (coreCloseExecutor-7268-thread-1) [    ] o.a.s.c.SolrCore [collection5]  CLOSING SolrCore org.apache.solr.core.SolrCore@635b0e4e
   [junit4]   2> 1834294 INFO  (coreCloseExecutor-7268-thread-1) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection5, tag=1666911822
   [junit4]   2> 1834294 INFO  (coreCloseExecutor-7268-thread-2) [    ] o.a.s.c.SolrCore [collection2]  CLOSING SolrCore org.apache.solr.core.SolrCore@3cf0a1f2
   [junit4]   2> 1834294 INFO  (coreCloseExecutor-7268-thread-1) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@25f1a13c: rootName = null, domain = solr.core.collection5, service url = null, agent id = null] for registry solr.core.collection5 / com.codahale.metrics.MetricRegistry@681d9c4c
   [junit4]   2> 1834302 INFO  (coreCloseExecutor-7268-thread-2) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection2, tag=1022403058
   [junit4]   2> 1834302 INFO  (coreCloseExecutor-7268-thread-2) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@35ea4c4a: rootName = null, domain = solr.core.collection2, service url = null, agent id = null] for registry solr.core.collection2 / com.codahale.metrics.MetricRegistry@566cf27e
   [junit4]   2> 1834322 INFO  (TEST-TestLazyCores.testMidUseUnload-seed#[5882D403B82F95B2]) [    ] o.a.s.SolrTestCaseJ4 ###Ending testMidUseUnload
   [junit4]   2> 1834325 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.SolrTestCaseJ4 ###Starting testRace
   [junit4]   2> 1834354 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Loading container configuration from /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/solr.xml
   [junit4]   2> 1834355 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay is ignored
   [junit4]   2> 1834355 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 1834356 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb, but no JMX reporters were configured - adding default JMX reporter.
   [junit4]   2> 1834385 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834397 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834398 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834401 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 transient cores
   [junit4]   2> 1834407 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1834408 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1834408 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1834420 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.s.IndexSchema [collection5] Schema name=tiny
   [junit4]   2> 1834422 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.s.IndexSchema [collection1] Schema name=tiny
   [junit4]   2> 1834422 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1834423 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection5' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/./collection5, trusted=true
   [junit4]   2> 1834423 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection5' (registry 'solr.core.collection5') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834423 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1834423 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.c.SolrCore [[collection5] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/collection5], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/./collection5/data/]
   [junit4]   2> 1834423 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.s.IndexSchema [collection2] Schema name=tiny
   [junit4]   2> 1834423 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1834424 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/./collection1, trusted=true
   [junit4]   2> 1834424 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834424 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1834424 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/collection1], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/./collection1/data/]
   [junit4]   2> 1834425 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1834425 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection2' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/./collection2, trusted=true
   [junit4]   2> 1834426 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection2' (registry 'solr.core.collection2') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834426 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1834426 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.c.SolrCore [[collection2] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/collection2], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/./collection2/data/]
   [junit4]   2> 1834427 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1834427 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1834429 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1834505 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1834505 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1834507 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1834508 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@364b7194[collection1] main]
   [junit4]   2> 1834508 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/collection1/conf
   [junit4]   2> 1834509 INFO  (coreLoadExecutor-7275-thread-1) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1834510 INFO  (searcherExecutor-7277-thread-1) [    ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@364b7194[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1834511 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1834511 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1834513 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1834513 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@3cccaa3a[collection2] main]
   [junit4]   2> 1834514 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/collection2/conf
   [junit4]   2> 1834514 INFO  (coreLoadExecutor-7275-thread-2) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1834515 INFO  (searcherExecutor-7278-thread-1) [    ] o.a.s.c.SolrCore [collection2] Registered new searcher Searcher@3cccaa3a[collection2] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1834515 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1834516 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1834516 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1834517 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@7abbfa15[collection5] main]
   [junit4]   2> 1834517 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/collection5/conf
   [junit4]   2> 1834517 INFO  (coreLoadExecutor-7275-thread-3) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1834518 INFO  (searcherExecutor-7276-thread-1) [    ] o.a.s.c.SolrCore [collection5] Registered new searcher Searcher@7abbfa15[collection5] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1834524 INFO  (Thread-3385) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1834528 INFO  (Thread-3385) [    ] o.a.s.s.IndexSchema [collection3] Schema name=tiny
   [junit4]   2> 1834529 INFO  (Thread-3385) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1834529 INFO  (Thread-3385) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection3' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/./collection3, trusted=true
   [junit4]   2> 1834529 INFO  (Thread-3385) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection3' (registry 'solr.core.collection3') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834529 INFO  (Thread-3385) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1834529 INFO  (Thread-3385) [    ] o.a.s.c.SolrCore [[collection3] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/collection3], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/./collection3/data/]
   [junit4]   2> 1834534 INFO  (Thread-3385) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1834571 INFO  (Thread-3385) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1834571 INFO  (Thread-3385) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1834572 INFO  (Thread-3385) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1834573 INFO  (Thread-3385) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@645525f9[collection3] main]
   [junit4]   2> 1834573 INFO  (Thread-3385) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-002/collection3/conf
   [junit4]   2> 1834573 INFO  (Thread-3385) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1834577 INFO  (searcherExecutor-7288-thread-1) [    ] o.a.s.c.SolrCore [collection3] Registered new searcher Searcher@645525f9[collection3] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1834577 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=11790769
   [junit4]   2> 1834577 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null
   [junit4]   2> 1834577 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@1318c1a7: rootName = null, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@11258fa1
   [junit4]   2> 1834581 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null
   [junit4]   2> 1834581 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@532d468d: rootName = null, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@5c219403
   [junit4]   2> 1834585 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null
   [junit4]   2> 1834585 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@413b9ff: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@4cfa726c
   [junit4]   2> 1834585 INFO  (coreCloseExecutor-7292-thread-1) [    ] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore org.apache.solr.core.SolrCore@2ccfdf9
   [junit4]   2> 1834585 INFO  (coreCloseExecutor-7292-thread-1) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection1, tag=46988793
   [junit4]   2> 1834585 INFO  (coreCloseExecutor-7292-thread-1) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@6ce48286: rootName = null, domain = solr.core.collection1, service url = null, agent id = null] for registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@6f8a8f4
   [junit4]   2> 1834585 INFO  (coreCloseExecutor-7292-thread-2) [    ] o.a.s.c.SolrCore [collection5]  CLOSING SolrCore org.apache.solr.core.SolrCore@20cc641a
   [junit4]   2> 1834586 INFO  (coreCloseExecutor-7292-thread-3) [    ] o.a.s.c.SolrCore [collection2]  CLOSING SolrCore org.apache.solr.core.SolrCore@72d54dd5
   [junit4]   2> 1834586 INFO  (coreCloseExecutor-7292-thread-4) [    ] o.a.s.c.SolrCore [collection3]  CLOSING SolrCore org.apache.solr.core.SolrCore@5533daeb
   [junit4]   2> 1834602 INFO  (coreCloseExecutor-7292-thread-2) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection5, tag=550265882
   [junit4]   2> 1834602 INFO  (coreCloseExecutor-7292-thread-2) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@536f4d31: rootName = null, domain = solr.core.collection5, service url = null, agent id = null] for registry solr.core.collection5 / com.codahale.metrics.MetricRegistry@2d4e023e
   [junit4]   2> 1834609 INFO  (coreCloseExecutor-7292-thread-3) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection2, tag=1926581717
   [junit4]   2> 1834609 INFO  (coreCloseExecutor-7292-thread-3) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@2395f616: rootName = null, domain = solr.core.collection2, service url = null, agent id = null] for registry solr.core.collection2 / com.codahale.metrics.MetricRegistry@a3eb7b6
   [junit4]   2> 1834618 INFO  (coreCloseExecutor-7292-thread-4) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection3, tag=1429461739
   [junit4]   2> 1834618 INFO  (coreCloseExecutor-7292-thread-4) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@119308e0: rootName = null, domain = solr.core.collection3, service url = null, agent id = null] for registry solr.core.collection3 / com.codahale.metrics.MetricRegistry@6fbb071b
   [junit4]   2> 1834626 INFO  (TEST-TestLazyCores.testRace-seed#[5882D403B82F95B2]) [    ] o.a.s.SolrTestCaseJ4 ###Ending testRace
   [junit4]   2> 1834627 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.SolrTestCaseJ4 ###Starting testLazySearch
   [junit4]   2> 1834651 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Loading container configuration from /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/solr.xml
   [junit4]   2> 1834654 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay is ignored
   [junit4]   2> 1834654 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 1834654 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb, but no JMX reporters were configured - adding default JMX reporter.
   [junit4]   2> 1834687 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834700 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834700 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834702 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 transient cores
   [junit4]   2> 1834709 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1834709 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1834710 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1834726 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.s.IndexSchema [collection2] Schema name=tiny
   [junit4]   2> 1834727 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.s.IndexSchema [collection1] Schema name=tiny
   [junit4]   2> 1834729 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1834729 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1834729 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection2' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/./collection2, trusted=true
   [junit4]   2> 1834729 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/./collection1, trusted=true
   [junit4]   2> 1834729 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834729 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection2' (registry 'solr.core.collection2') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834729 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1834729 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1834730 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.s.IndexSchema [collection5] Schema name=tiny
   [junit4]   2> 1834730 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.c.SolrCore [[collection2] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/collection2], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/./collection2/data/]
   [junit4]   2> 1834730 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/collection1], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/./collection1/data/]
   [junit4]   2> 1834731 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1834731 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection5' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/./collection5, trusted=true
   [junit4]   2> 1834732 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection5' (registry 'solr.core.collection5') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834732 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1834732 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.c.SolrCore [[collection5] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/collection5], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/./collection5/data/]
   [junit4]   2> 1834734 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1834734 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1834735 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1834822 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1834822 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1834824 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1834828 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@7128126c[collection2] main]
   [junit4]   2> 1834828 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1834828 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1834828 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1834828 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1834828 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/collection2/conf
   [junit4]   2> 1834829 INFO  (coreLoadExecutor-7299-thread-2) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1834829 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1834829 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1834830 INFO  (searcherExecutor-7300-thread-1) [    ] o.a.s.c.SolrCore [collection2] Registered new searcher Searcher@7128126c[collection2] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1834830 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@758239[collection1] main]
   [junit4]   2> 1834830 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@7ab4e109[collection5] main]
   [junit4]   2> 1834830 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/collection1/conf
   [junit4]   2> 1834831 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/collection5/conf
   [junit4]   2> 1834831 INFO  (coreLoadExecutor-7299-thread-1) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1834831 INFO  (coreLoadExecutor-7299-thread-3) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1834832 INFO  (searcherExecutor-7301-thread-1) [    ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@758239[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1834832 INFO  (searcherExecutor-7302-thread-1) [    ] o.a.s.c.SolrCore [collection5] Registered new searcher Searcher@7ab4e109[collection5] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1834838 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1834844 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.s.IndexSchema [collection4] Schema name=tiny
   [junit4]   2> 1834846 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1834846 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection4' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/./collection4, trusted=true
   [junit4]   2> 1834847 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection4' (registry 'solr.core.collection4') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1834847 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1834847 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore [[collection4] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/collection4], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/./collection4/data/]
   [junit4]   2> 1834851 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=10, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.2945275058399176]
   [junit4]   2> 1834906 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1834906 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1834907 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=25, maxMergeAtOnceExplicit=12, maxMergedSegmentMB=78.669921875, floorSegmentMB=0.599609375, forceMergeDeletesPctAllowed=11.057138007652615, segmentsPerTier=49.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.23258777302549483
   [junit4]   2> 1834908 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@30963fe2[collection4] main]
   [junit4]   2> 1834908 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-003/collection4/conf
   [junit4]   2> 1834909 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1834910 INFO  (searcherExecutor-7312-thread-1) [    ] o.a.s.c.SolrCore [collection4] Registered new searcher Searcher@30963fe2[collection4] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1834910 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.u.DirectUpdateHandler2 start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 1834910 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.u.SolrIndexWriter Calling setCommitData with IW:org.apache.solr.update.SolrIndexWriter@3623ffe8 commitCommandVersion:0
   [junit4]   2> 1834939 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@410b215b[collection4] main]
   [junit4]   2> 1834939 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 1834940 INFO  (searcherExecutor-7312-thread-1) [    ] o.a.s.c.SolrCore [collection4] Registered new searcher Searcher@410b215b[collection4] main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.2.0):C7)))}
   [junit4]   2> 1834941 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.S.Request [collection4]  webapp=null path=null params={q={!prefix+f%3Dv_t}hel&wt=xml} hits=2 status=0 QTime=0
   [junit4]   2> 1834942 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.S.Request [collection4]  webapp=null path=null params={q={!raw+f%3Dv_t}hello&wt=xml} hits=2 status=0 QTime=0
   [junit4]   2> 1834942 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.S.Request [collection4]  webapp=null path=null params={q={!raw+f%3Dv_t}Hello&wt=xml} hits=0 status=0 QTime=0
   [junit4]   2> 1834943 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.S.Request [collection4]  webapp=null path=null params={q={!raw+f%3Dv_f}1.5&wt=xml} hits=0 status=0 QTime=0
   [junit4]   2> 1834943 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.S.Request [collection1]  webapp=null path=null params={q={!raw+f%3Dv_t}hello&wt=xml} hits=0 status=0 QTime=0
   [junit4]   2> 1834943 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=615323057
   [junit4]   2> 1834943 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null
   [junit4]   2> 1834943 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@1616a050: rootName = null, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@52af2329
   [junit4]   2> 1834949 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null
   [junit4]   2> 1834949 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@38cc873d: rootName = null, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@5c219403
   [junit4]   2> 1834954 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null
   [junit4]   2> 1834954 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@21acd96b: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@4cfa726c
   [junit4]   2> 1834955 INFO  (coreCloseExecutor-7316-thread-1) [    ] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore org.apache.solr.core.SolrCore@7d57edd5
   [junit4]   2> 1834955 INFO  (coreCloseExecutor-7316-thread-1) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection1, tag=2102914517
   [junit4]   2> 1834955 INFO  (coreCloseExecutor-7316-thread-1) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@2fc85a83: rootName = null, domain = solr.core.collection1, service url = null, agent id = null] for registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@1b29c1cf
   [junit4]   2> 1834955 INFO  (coreCloseExecutor-7316-thread-2) [    ] o.a.s.c.SolrCore [collection5]  CLOSING SolrCore org.apache.solr.core.SolrCore@43e6d37e
   [junit4]   2> 1834955 INFO  (coreCloseExecutor-7316-thread-3) [    ] o.a.s.c.SolrCore [collection4]  CLOSING SolrCore org.apache.solr.core.SolrCore@79db6f33
   [junit4]   2> 1834967 INFO  (coreCloseExecutor-7316-thread-4) [    ] o.a.s.c.SolrCore [collection2]  CLOSING SolrCore org.apache.solr.core.SolrCore@185f6b3a
   [junit4]   2> 1834976 INFO  (coreCloseExecutor-7316-thread-2) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection5, tag=1139200894
   [junit4]   2> 1834977 INFO  (coreCloseExecutor-7316-thread-2) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@7989ca23: rootName = null, domain = solr.core.collection5, service url = null, agent id = null] for registry solr.core.collection5 / com.codahale.metrics.MetricRegistry@7a3397d0
   [junit4]   2> 1834986 INFO  (coreCloseExecutor-7316-thread-3) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection4, tag=2044423987
   [junit4]   2> 1834987 INFO  (coreCloseExecutor-7316-thread-3) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@6bf306f7: rootName = null, domain = solr.core.collection4, service url = null, agent id = null] for registry solr.core.collection4 / com.codahale.metrics.MetricRegistry@ced0627
   [junit4]   2> 1834996 INFO  (coreCloseExecutor-7316-thread-4) [    ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection2, tag=408906554
   [junit4]   2> 1834996 INFO  (coreCloseExecutor-7316-thread-4) [    ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@387344b7: rootName = null, domain = solr.core.collection2, service url = null, agent id = null] for registry solr.core.collection2 / com.codahale.metrics.MetricRegistry@2de05be
   [junit4]   2> 1835007 INFO  (TEST-TestLazyCores.testLazySearch-seed#[5882D403B82F95B2]) [    ] o.a.s.SolrTestCaseJ4 ###Ending testLazySearch
   [junit4]   2> 1835009 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.SolrTestCaseJ4 ###Starting testNoCommit
   [junit4]   2> 1835037 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Loading container configuration from /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/solr.xml
   [junit4]   2> 1835038 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay is ignored
   [junit4]   2> 1835038 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 1835039 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb, but no JMX reporters were configured - adding default JMX reporter.
   [junit4]   2> 1835063 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1835071 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1835071 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1835072 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 transient cores
   [junit4]   2> 1835079 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1835080 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1835080 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1835096 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.s.IndexSchema [collection1] Schema name=tiny
   [junit4]   2> 1835096 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.s.IndexSchema [collection2] Schema name=tiny
   [junit4]   2> 1835098 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1835098 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection1, trusted=true
   [junit4]   2> 1835099 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1835099 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1835099 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection1], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection1/data/]
   [junit4]   2> 1835100 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1835100 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection2' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection2, trusted=true
   [junit4]   2> 1835100 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection2' (registry 'solr.core.collection2') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1835100 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1835100 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.c.SolrCore [[collection2] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection2], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection2/data/]
   [junit4]   2> 1835096 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.s.IndexSchema [collection5] Schema name=tiny
   [junit4]   2> 1835103 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1835103 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection5' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection5, trusted=true
   [junit4]   2> 1835103 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection5' (registry 'solr.core.collection5') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1835103 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1835104 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.c.SolrCore [[collection5] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection5], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection5/data/]
   [junit4]   2> 1835104 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1835106 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1835107 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=18, maxMergeAtOnceExplicit=33, maxMergedSegmentMB=15.080078125, floorSegmentMB=1.0234375, forceMergeDeletesPctAllowed=25.757731352185964, segmentsPerTier=10.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1835169 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1835169 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1835170 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1835171 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1835171 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1835171 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@54b68367[collection1] main]
   [junit4]   2> 1835172 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection1/conf
   [junit4]   2> 1835172 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1835172 INFO  (coreLoadExecutor-7323-thread-1) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1835173 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1835173 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1835173 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@5823777c[collection5] main]
   [junit4]   2> 1835173 INFO  (searcherExecutor-7324-thread-1) [    ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@54b68367[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1835173 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection5/conf
   [junit4]   2> 1835174 INFO  (coreLoadExecutor-7323-thread-3) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1835175 INFO  (searcherExecutor-7326-thread-1) [    ] o.a.s.c.SolrCore [collection5] Registered new searcher Searcher@5823777c[collection5] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1835176 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=33, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3377283168244348]
   [junit4]   2> 1835177 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@e5230fc[collection2] main]
   [junit4]   2> 1835177 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection2/conf
   [junit4]   2> 1835178 INFO  (coreLoadExecutor-7323-thread-2) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1835179 INFO  (searcherExecutor-7325-thread-1) [    ] o.a.s.c.SolrCore [collection2] Registered new searcher Searcher@e5230fc[collection2] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1835186 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1835191 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.s.IndexSchema [collection3] Schema name=tiny
   [junit4]   2> 1835192 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1835193 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection3' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection3, trusted=true
   [junit4]   2> 1835193 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection3' (registry 'solr.core.collection3') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1835193 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1835193 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore [[collection3] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection3], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection3/data/]
   [junit4]   2> 1835197 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=33, maxMergeAtOnceExplicit=17, maxMergedSegmentMB=63.12109375, floorSegmentMB=1.130859375, forceMergeDeletesPctAllowed=2.487598902884105, segmentsPerTier=13.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
   [junit4]   2> 1835271 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1835271 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1835273 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=43, maxMergeAtOnceExplicit=21, maxMergedSegmentMB=13.0546875, floorSegmentMB=0.8193359375, forceMergeDeletesPctAllowed=29.789201496414066, segmentsPerTier=37.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.0
   [junit4]   2> 1835274 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@3689183f[collection3] main]
   [junit4]   2> 1835274 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection3/conf
   [junit4]   2> 1835275 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1835275 INFO  (searcherExecutor-7336-thread-1) [    ] o.a.s.c.SolrCore [collection3] Registered new searcher Searcher@3689183f[collection3] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 1835291 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.2.0
   [junit4]   2> 1835295 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.s.IndexSchema [collection6] Schema name=tiny
   [junit4]   2> 1835296 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id
   [junit4]   2> 1835296 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.CoreContainer Creating SolrCore 'collection6' using configuration from instancedir /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection6, trusted=true
   [junit4]   2> 1835297 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection6' (registry 'solr.core.collection6') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@7ce22cfb
   [junit4]   2> 1835297 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 1835297 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.c.SolrCore [[collection6] ] Opening new SolrCore at [/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection6], dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/./collection6/data/]
   [junit4]   2> 1835300 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=23, maxMergedSegmentMB=80.5439453125, floorSegmentMB=1.06640625, forceMergeDeletesPctAllowed=12.450349188826804, segmentsPerTier=21.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.0
   [junit4]   2> 1835343 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 1835344 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1835345 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=46, maxMergeAtOnceExplicit=45, maxMergedSegmentMB=90.2861328125, floorSegmentMB=0.943359375, forceMergeDeletesPctAllowed=22.86354608570781, segmentsPerTier=50.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.596101509903343
   [junit4]   2> 1835346 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.s.SolrIndexSearcher Opening [Searcher@749f599d[collection6] main]
   [junit4]   2> 1835346 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J1/temp/solr.core.TestLazyCores_5882D403B82F95B2-001/tempDir-004/collection6/conf
   [junit4]   2> 1835347 INFO  (TEST-TestLazyCores.testNoCommit-seed#[5882D403B82F95B2]) [    ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 1835

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

       at java.base@9/jdk.internal.misc.Unsafe.park(Native Method)
   [junit4]   2>         at java.base@9/java.util.concurrent.locks.LockSupport.park(LockSupport.java:194)
   [junit4]   2>         at java.base@9/java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2062)
   [junit4]   2>         at java.base@9/java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:435)
   [junit4]   2>         at java.base@9/java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1092)
   [junit4]   2>         at java.base@9/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1152)
   [junit4]   2>         at java.base@9/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:641)
   [junit4]   2>         at java.base@9/java.lang.Thread.run(Thread.java:844)
   [junit4]   2> Dec 03, 2017 5:11:54 PM com.carrotsearch.randomizedtesting.ThreadLeakControl tryToInterruptAll
   [junit4]   2> INFO: Starting to interrupt leaked threads:
   [junit4]   2>    1) Thread[id=17025, name=searcherExecutor-7356-thread-1, state=WAITING, group=TGRP-TestLazyCores]
   [junit4]   2> Dec 03, 2017 5:11:57 PM com.carrotsearch.randomizedtesting.ThreadLeakControl tryToInterruptAll
   [junit4]   2> SEVERE: There are still zombie threads that couldn't be terminated:
   [junit4]   2>    1) Thread[id=17025, name=searcherExecutor-7356-thread-1, state=WAITING, group=TGRP-TestLazyCores]
   [junit4]   2>         at java.base@9/jdk.internal.misc.Unsafe.park(Native Method)
   [junit4]   2>         at java.base@9/java.util.concurrent.locks.LockSupport.park(LockSupport.java:194)
   [junit4]   2>         at java.base@9/java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2062)
   [junit4]   2>         at java.base@9/java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:435)
   [junit4]   2>         at java.base@9/java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1092)
   [junit4]   2>         at java.base@9/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1152)
   [junit4]   2>         at java.base@9/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:641)
   [junit4]   2>         at java.base@9/java.lang.Thread.run(Thread.java:844)
   [junit4]   2> NOTE: test params are: codec=CheapBastard, sim=RandomSimilarity(queryNorm=false): {}, locale=en-GG, timezone=Etc/GMT+7
   [junit4]   2> NOTE: Mac OS X 10.11.6 x86_64/Oracle Corporation 9 (64-bit)/cpus=3,threads=2,free=216762792,total=518979584
   [junit4]   2> NOTE: All tests run in this JVM: [TestInitParams, PolyFieldTest, TestBulkSchemaConcurrent, V2StandaloneTest, CopyFieldTest, TestLRUCache, TestHdfsBackupRestoreCore, SampleTest, SOLR749Test, TestExportWriter, ExternalFileFieldSortTest, TestStressCloudBlindAtomicUpdates, TestDocumentBuilder, SchemaVersionSpecificBehaviorTest, TestSystemCollAutoCreate, TestFreeTextSuggestions, SolrMetricReporterTest, StatsReloadRaceTest, HdfsDirectoryFactoryTest, TestSolrJ, TestCollationField, TestCollectionsAPIViaSolrCloudCluster, SSLMigrationTest, CdcrUpdateLogTest, TestElisionMultitermQuery, CdcrRequestHandlerTest, SimplePostToolTest, CurrencyFieldTypeTest, TestHalfAndHalfDocValues, TestFieldCacheSort, TestSubQueryTransformerDistrib, AutoAddReplicasIntegrationTest, TestExpandComponent, TestBadConfig, DistribDocExpirationUpdateProcessorTest, SolrJmxReporterCloudTest, TestCharFilters, TestRandomFaceting, SoftAutoCommitTest, StatelessScriptUpdateProcessorFactoryTest, LeaderFailoverAfterPartitionTest, CollectionStateFormat2Test, TestManagedSynonymGraphFilterFactory, TestImplicitCoreProperties, LeaderInitiatedRecoveryOnCommitTest, LoggingHandlerTest, TestLegacyNumericRangeQueryBuilder, TermVectorComponentTest, MoreLikeThisHandlerTest, TestManagedResourceStorage, TestBlendedInfixSuggestions, HdfsUnloadDistributedZkTest, QueryEqualityTest, DocExpirationUpdateProcessorFactoryTest, TestXmlQParserPlugin, CdcrBidirectionalTest, TestInPlaceUpdatesStandalone, TestSearcherReuse, FullSolrCloudDistribCmdsTest, DistributedIntervalFacetingTest, TestSolrCloudWithKerberosAlt, MissingSegmentRecoveryTest, DistributedFacetPivotWhiteBoxTest, TestOnReconnectListenerSupport, BasicDistributedZk2Test, SynonymTokenizerTest, MultiThreadedOCPTest, TestStressReorder, TestSSLRandomization, TestLegacyFieldReuse, ShardSplitTest, TestManagedSchemaAPI, TestSolrCoreSnapshots, LeaderElectionIntegrationTest, TestCustomStream, TestNestedDocsSort, TestBulkSchemaAPI, EchoParamsTest, PingRequestHandlerTest, TestAnalyzedSuggestions, HdfsThreadLeakTest, ZkSolrClientTest, TestFastOutputStream, OverseerRolesTest, SolrShardReporterTest, DistributedQueueTest, TestPartialUpdateDeduplication, CheckHdfsIndexTest, TestLegacyTerms, TestAuthenticationFramework, TestPivotHelperCode, TestQueryWrapperFilter, TestMaxTokenLenTokenizer, TestGraphMLResponseWriter, AddBlockUpdateTest, TestSolrDeletionPolicy1, TestCloudSchemaless, ZkStateReaderTest, TestPostingsSolrHighlighter, TestPayloadCheckQParserPlugin, TestManagedStopFilterFactory, VersionInfoTest, SpatialHeatmapFacetsTest, LegacyCloudClusterPropTest, TestDistributedMissingSort, TestSolrQueryParser, OutOfBoxZkACLAndCredentialsProvidersTest, VMParamsZkACLAndCredentialsProvidersTest, TestSort, TestBM25SimilarityFactory, TestSolrCoreParser, HttpTriggerListenerTest, CdcrReplicationDistributedZkTest, TestConfigSetsAPIExclusivity, TestLuceneMatchVersion, ShardRoutingCustomTest, IndexSchemaRuntimeFieldTest, GraphQueryTest, SimpleCollectionCreateDeleteTest, UninvertDocValuesMergePolicyTest, SearchHandlerTest, TestNumericTerms64, TestIndexSearcher, TestCustomSort, TestScoreJoinQPScore, BufferStoreTest, TestCryptoKeys, SystemInfoHandlerTest, TestStressLucene, PKIAuthenticationIntegrationTest, TestFilteredDocIdSet, TestUseDocValuesAsStored2, TriggerIntegrationTest, FacetPivotSmallTest, TestRawTransformer, BasicZkTest, PluginInfoTest, ClassificationUpdateProcessorTest, TestCrossCoreJoin, HdfsRecoverLeaseTest, CollectionsAPIAsyncDistributedZkTest, TestSha256AuthenticationProvider, TestUnifiedSolrHighlighter, OverseerTaskQueueTest, ReplaceNodeTest, AnalysisAfterCoreReloadTest, TestNoOpRegenerator, BigEndianAscendingWordSerializerTest, SolrCoreCheckLockOnStartupTest, UpdateRequestProcessorFactoryTest, ChaosMonkeySafeLeaderTest, TestIntervalFaceting, CloudMLTQParserTest, RankQueryTest, TestReload, TestCloudRecovery, TestNonDefinedSimilarityFactory, ConnectionManagerTest, TestRebalanceLeaders, ZkNodePropsTest, TestReloadAndDeleteDocs, TestSimpleTextCodec, TestCollectionAPIs, DebugComponentTest, SparseHLLTest, SystemLogListenerTest, SolrIndexSplitterTest, TestTrie, QueryElevationComponentTest, DocValuesMultiTest, PreAnalyzedFieldTest, TestDistributedGrouping, TestExclusionRuleCollectionAccess, TestPushWriter, FileBasedSpellCheckerTest, TestLeaderInitiatedRecoveryThread, RestartWhileUpdatingTest, TestCloudInspectUtil, BooleanFieldTest, TestDynamicFieldCollectionResource, TestFiltering, TestFunctionQuery, BasicFunctionalityTest, TestLazyCores]
   [junit4]   2> NOTE: reproduce with: ant test  -Dtestcase=TestLazyCores -Dtests.seed=5882D403B82F95B2 -Dtests.slow=true -Dtests.locale=en-GG -Dtests.timezone=Etc/GMT+7 -Dtests.asserts=true -Dtests.file.encoding=UTF-8
   [junit4] ERROR   0.00s J1 | TestLazyCores (suite) <<<
   [junit4]    > Throwable #1: com.carrotsearch.randomizedtesting.ThreadLeakError: 1 thread leaked from SUITE scope at org.apache.solr.core.TestLazyCores: 
   [junit4]    >    1) Thread[id=17025, name=searcherExecutor-7356-thread-1, state=WAITING, group=TGRP-TestLazyCores]
   [junit4]    >         at java.base@9/jdk.internal.misc.Unsafe.park(Native Method)
   [junit4]    >         at java.base@9/java.util.concurrent.locks.LockSupport.park(LockSupport.java:194)
   [junit4]    >         at java.base@9/java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2062)
   [junit4]    >         at java.base@9/java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:435)
   [junit4]    >         at java.base@9/java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1092)
   [junit4]    >         at java.base@9/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1152)
   [junit4]    >         at java.base@9/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:641)
   [junit4]    >         at java.base@9/java.lang.Thread.run(Thread.java:844)
   [junit4]    > 	at __randomizedtesting.SeedInfo.seed([5882D403B82F95B2]:0)Throwable #2: com.carrotsearch.randomizedtesting.ThreadLeakError: There are still zombie threads that couldn't be terminated:
   [junit4]    >    1) Thread[id=17025, name=searcherExecutor-7356-thread-1, state=WAITING, group=TGRP-TestLazyCores]
   [junit4]    >         at java.base@9/jdk.internal.misc.Unsafe.park(Native Method)
   [junit4]    >         at java.base@9/java.util.concurrent.locks.LockSupport.park(LockSupport.java:194)
   [junit4]    >         at java.base@9/java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2062)
   [junit4]    >         at java.base@9/java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:435)
   [junit4]    >         at java.base@9/java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1092)
   [junit4]    >         at java.base@9/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1152)
   [junit4]    >         at java.base@9/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:641)
   [junit4]    >         at java.base@9/java.lang.Thread.run(Thread.java:844)
   [junit4]    > 	at __randomizedtesting.SeedInfo.seed([5882D403B82F95B2]:0)
   [junit4] Completed [419/750 (1!)] on J1 in 30.10s, 9 tests, 3 errors <<< FAILURES!

[...truncated 41178 lines...]

Mime
View raw message