Build: https://builds.apache.org/job/Lucene-Solr-Tests-6.x/698/
3 tests failed. FAILED: junit.framework.TestSuite.org.apache.solr.core.TestLazyCores Error Message: ObjectTracker found 5 object(s) that were not released!!! [MockDirectoryWrapper, MockDirectoryWrapper, SolrCore, MDCAwareThreadPoolExecutor, MockDirectoryWrapper] org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.CachingDirectoryFactory.get(CachingDirectoryFactory.java:347) at org.apache.solr.core.MetricsDirectoryFactory.get(MetricsDirectoryFactory.java:201) at org.apache.solr.core.SolrCore.initSnapshotMetaDataManager(SolrCore.java:479) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:884) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.CachingDirectoryFactory.get(CachingDirectoryFactory.java:347) at org.apache.solr.core.MetricsDirectoryFactory.get(MetricsDirectoryFactory.java:201) at org.apache.solr.core.SolrCore.getNewIndexDir(SolrCore.java:348) at org.apache.solr.core.SolrCore.initIndex(SolrCore.java:673) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:890) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:980) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:830) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.CachingDirectoryFactory.get(CachingDirectoryFactory.java:347) at org.apache.solr.core.MetricsDirectoryFactory.get(MetricsDirectoryFactory.java:201) at org.apache.solr.update.SolrIndexWriter.create(SolrIndexWriter.java:97) at org.apache.solr.core.SolrCore.initIndex(SolrCore.java:705) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:890) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) Stack Trace: java.lang.AssertionError: ObjectTracker found 5 object(s) that were not released!!! [MockDirectoryWrapper, MockDirectoryWrapper, SolrCore, MDCAwareThreadPoolExecutor, MockDirectoryWrapper] org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.CachingDirectoryFactory.get(CachingDirectoryFactory.java:347) at org.apache.solr.core.MetricsDirectoryFactory.get(MetricsDirectoryFactory.java:201) at org.apache.solr.core.SolrCore.initSnapshotMetaDataManager(SolrCore.java:479) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:884) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.CachingDirectoryFactory.get(CachingDirectoryFactory.java:347) at org.apache.solr.core.MetricsDirectoryFactory.get(MetricsDirectoryFactory.java:201) at org.apache.solr.core.SolrCore.getNewIndexDir(SolrCore.java:348) at org.apache.solr.core.SolrCore.initIndex(SolrCore.java:673) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:890) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:980) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:830) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) at org.apache.solr.core.CachingDirectoryFactory.get(CachingDirectoryFactory.java:347) at org.apache.solr.core.MetricsDirectoryFactory.get(MetricsDirectoryFactory.java:201) at org.apache.solr.update.SolrIndexWriter.create(SolrIndexWriter.java:97) at org.apache.solr.core.SolrCore.initIndex(SolrCore.java:705) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:890) at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) at java.util.concurrent.FutureTask.run(FutureTask.java:266) at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) at __randomizedtesting.SeedInfo.seed([1ABEF390C14AADF2]:0) at org.junit.Assert.fail(Assert.java:93) at org.junit.Assert.assertTrue(Assert.java:43) at org.junit.Assert.assertNull(Assert.java:551) at org.apache.solr.SolrTestCaseJ4.teardownTestCases(SolrTestCaseJ4.java:269) at sun.reflect.GeneratedMethodAccessor22.invoke(Unknown Source) at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) at java.lang.reflect.Method.invoke(Method.java:498) at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1713) at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:870) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41) at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53) at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368) at java.lang.Thread.run(Thread.java:745) FAILED: 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=7526, name=searcherExecutor-3954-thread-1, state=WAITING, group=TGRP-TestLazyCores] at sun.misc.Unsafe.park(Native Method) at java.util.concurrent.locks.LockSupport.park(LockSupport.java:175) at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2039) at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442) at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1067) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1127) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) Stack Trace: com.carrotsearch.randomizedtesting.ThreadLeakError: 1 thread leaked from SUITE scope at org.apache.solr.core.TestLazyCores: 1) Thread[id=7526, name=searcherExecutor-3954-thread-1, state=WAITING, group=TGRP-TestLazyCores] at sun.misc.Unsafe.park(Native Method) at java.util.concurrent.locks.LockSupport.park(LockSupport.java:175) at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2039) at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442) at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1067) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1127) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) at __randomizedtesting.SeedInfo.seed([1ABEF390C14AADF2]: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=7526, name=searcherExecutor-3954-thread-1, state=WAITING, group=TGRP-TestLazyCores] at sun.misc.Unsafe.park(Native Method) at java.util.concurrent.locks.LockSupport.park(LockSupport.java:175) at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2039) at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442) at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1067) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1127) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) Stack Trace: com.carrotsearch.randomizedtesting.ThreadLeakError: There are still zombie threads that couldn't be terminated: 1) Thread[id=7526, name=searcherExecutor-3954-thread-1, state=WAITING, group=TGRP-TestLazyCores] at sun.misc.Unsafe.park(Native Method) at java.util.concurrent.locks.LockSupport.park(LockSupport.java:175) at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2039) at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442) at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1067) at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1127) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) at java.lang.Thread.run(Thread.java:745) at __randomizedtesting.SeedInfo.seed([1ABEF390C14AADF2]:0) Build Log: [...truncated 11677 lines...] [junit4] Suite: org.apache.solr.core.TestLazyCores [junit4] 2> Creating dataDir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/init-core-data-001 [junit4] 2> 864473 INFO (SUITE-TestLazyCores-seed#[1ABEF390C14AADF2]-worker) [ ] o.a.s.SolrTestCaseJ4 Randomized ssl (true) and clientAuth (true) via: @org.apache.solr.util.RandomizeSSL(reason=, value=NaN, ssl=NaN, clientAuth=NaN) [junit4] 2> 864475 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testCreateSame [junit4] 2> 864491 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ ] o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params: socketTimeout=600000&connTimeout=60000&retry=true [junit4] 2> 864492 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ ] o.a.s.c.SolrCores Allocating transient cache for 4 transient cores [junit4] 2> 864512 WARN (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 864513 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 864514 WARN (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 864515 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 864529 WARN (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 864529 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 864538 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.s.IndexSchema [collection5] Schema name=tiny [junit4] 2> 864539 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=tiny [junit4] 2> 864541 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 864541 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 864543 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection1 [junit4] 2> 864543 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.c.CoreContainer Creating SolrCore 'collection5' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection5 [junit4] 2> 864543 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection1], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection1/data/] [junit4] 2> 864544 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=43, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.4156172817436683] [junit4] 2> 864545 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.c.SolrCore [[collection5] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection5], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection5/data/] [junit4] 2> 864545 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.s.IndexSchema [collection2] Schema name=tiny [junit4] 2> 864546 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=43, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.4156172817436683] [junit4] 2> 864548 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 864557 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.c.CoreContainer Creating SolrCore 'collection2' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection2 [junit4] 2> 864557 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.c.SolrCore [[collection2] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection2], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection2/data/] [junit4] 2> 864558 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=43, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.4156172817436683] [junit4] 2> 864566 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 864566 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 864568 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=25, maxMergedSegmentMB=7.060546875, floorSegmentMB=2.1123046875, forceMergeDeletesPctAllowed=21.449361920418045, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0 [junit4] 2> 864569 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@5154cd2b[collection1] main] [junit4] 2> 864569 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection1/conf [junit4] 2> 864569 INFO (coreLoadExecutor-3741-thread-1) [ x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 864572 INFO (searcherExecutor-3742-thread-1-processing-x:collection1) [ x:collection1] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@5154cd2b[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 864572 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 864572 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 864573 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=25, maxMergedSegmentMB=7.060546875, floorSegmentMB=2.1123046875, forceMergeDeletesPctAllowed=21.449361920418045, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0 [junit4] 2> 864573 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.s.SolrIndexSearcher Opening [Searcher@6d2a3700[collection2] main] [junit4] 2> 864573 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection2/conf [junit4] 2> 864574 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 864585 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 864585 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 864578 INFO (coreLoadExecutor-3741-thread-2) [ x:collection2] o.a.s.c.SolrCores Opening transient core collection2 [junit4] 2> 864586 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=25, maxMergedSegmentMB=7.060546875, floorSegmentMB=2.1123046875, forceMergeDeletesPctAllowed=21.449361920418045, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0 [junit4] 2> 864586 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.s.SolrIndexSearcher Opening [Searcher@1f669692[collection5] main] [junit4] 2> 864587 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection5/conf [junit4] 2> 864587 INFO (coreLoadExecutor-3741-thread-3) [ x:collection5] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 864587 INFO (searcherExecutor-3745-thread-1-processing-x:collection2) [ x:collection2] o.a.s.c.SolrCore [collection2] Registered new searcher Searcher@6d2a3700[collection2] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 864587 INFO (searcherExecutor-3743-thread-1-processing-x:collection5) [ x:collection5] o.a.s.c.SolrCore [collection5] Registered new searcher Searcher@1f669692[collection5] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 864596 WARN (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 864597 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 864608 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.IndexSchema [collection4] Schema name=tiny [junit4] 2> 864611 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 864612 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Creating SolrCore 'collection4' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection4 [junit4] 2> 864613 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore [[collection4] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection4], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection4/data/] [junit4] 2> 864615 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=19, maxMergeAtOnceExplicit=14, maxMergedSegmentMB=84.6396484375, floorSegmentMB=0.798828125, forceMergeDeletesPctAllowed=15.568196280056299, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.0 [junit4] 2> 864636 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 864636 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 864637 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=47, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.0] [junit4] 2> 864638 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.SolrIndexSearcher Opening [Searcher@71a0682[collection4] main] [junit4] 2> 864639 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection4/conf [junit4] 2> 864639 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 864640 INFO (searcherExecutor-3755-thread-1-processing-x:collection4) [ x:collection4] o.a.s.c.SolrCore [collection4] Registered new searcher Searcher@71a0682[collection4] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 864651 WARN (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 864652 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 864661 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.IndexSchema [collection6] Schema name=tiny [junit4] 2> 864664 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 864665 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Creating SolrCore 'collection6' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection6 [junit4] 2> 864665 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore [[collection6] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection6], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection6/data/] [junit4] 2> 864667 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: minMergeSize=1000, mergeFactor=20, maxMergeSize=9223372036854775807, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.7689148721949691] [junit4] 2> 864679 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 864679 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 864680 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.AlcoholicMergePolicy: [AlcoholicMergePolicy: minMergeSize=0, mergeFactor=10, maxMergeSize=951077290, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.1] [junit4] 2> 864681 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.SolrIndexSearcher Opening [Searcher@7e944d0c[collection6] main] [junit4] 2> 864681 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-001/collection6/conf [junit4] 2> 864681 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 864682 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCores Opening transient core collection6 [junit4] 2> 864685 INFO (searcherExecutor-3759-thread-1-processing-x:collection4) [ x:collection4] o.a.s.c.SolrCore [collection6] Registered new searcher Searcher@7e944d0c[collection6] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 864698 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.h.a.CoreAdminOperation core create command schema=schema.xml&dataDir=t12&name=collection2&action=CREATE&config=solrconfig.xml&wt=xml [junit4] 2> 864698 WARN (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Creating a core with existing name is not allowed [junit4] 2> 864698 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.h.a.CoreAdminOperation core create command schema=schema.xml&dataDir=t14&name=collection4&action=CREATE&config=solrconfig.xml&wt=xml [junit4] 2> 864699 WARN (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Creating a core with existing name is not allowed [junit4] 2> 864699 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.h.a.CoreAdminOperation core create command schema=schema.xml&dataDir=t15&name=collection5&action=CREATE&config=solrconfig.xml&wt=xml [junit4] 2> 864713 WARN (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Creating a core with existing name is not allowed [junit4] 2> 864713 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.h.a.CoreAdminOperation core create command schema=schema.xml&dataDir=t16&name=collection6&action=CREATE&config=solrconfig.xml&wt=xml [junit4] 2> 864714 WARN (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Creating a core with existing name is not allowed [junit4] 2> 864714 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Shutting down CoreContainer instance=1575852029 [junit4] 2> 864718 INFO (coreCloseExecutor-3763-thread-1-processing-x:collection4) [ x:collection1] o.a.s.c.SolrCore [collection1] CLOSING SolrCore org.apache.solr.core.SolrCore@abcafb1 [junit4] 2> 864719 INFO (coreCloseExecutor-3763-thread-2-processing-x:collection4) [ x:collection5] o.a.s.c.SolrCore [collection5] CLOSING SolrCore org.apache.solr.core.SolrCore@1becc74d [junit4] 2> 864719 INFO (coreCloseExecutor-3763-thread-3-processing-x:collection4) [ x:collection4] o.a.s.c.SolrCore [collection4] CLOSING SolrCore org.apache.solr.core.SolrCore@615cb114 [junit4] 2> 864719 INFO (coreCloseExecutor-3763-thread-4-processing-x:collection4) [ x:collection2] o.a.s.c.SolrCore [collection2] CLOSING SolrCore org.apache.solr.core.SolrCore@7512e17d [junit4] 2> 864726 INFO (coreCloseExecutor-3763-thread-1-processing-x:collection4) [ x:collection1] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection1 [junit4] 2> 864726 INFO (coreCloseExecutor-3763-thread-3-processing-x:collection4) [ x:collection4] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection4 [junit4] 2> 864726 INFO (coreCloseExecutor-3763-thread-2-processing-x:collection4) [ x:collection5] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection5 [junit4] 2> 864727 INFO (coreCloseExecutor-3763-thread-4-processing-x:collection4) [ x:collection2] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection2 [junit4] 2> 864728 INFO (coreCloseExecutor-3763-thread-5-processing-x:collection4) [ x:collection6] o.a.s.c.SolrCore [collection6] CLOSING SolrCore org.apache.solr.core.SolrCore@b592f35 [junit4] 2> 864728 INFO (coreCloseExecutor-3763-thread-5-processing-x:collection4) [ x:collection6] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection6 [junit4] 2> 864729 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.node [junit4] 2> 864729 INFO (TEST-TestLazyCores.testCreateSame-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.SolrTestCaseJ4 ###Ending testCreateSame [junit4] 2> 864730 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.SolrTestCaseJ4 ###Starting testMidUseUnload [junit4] 2> 864746 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params: socketTimeout=600000&connTimeout=60000&retry=true [junit4] 2> 864747 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCores Allocating transient cache for 4 transient cores [junit4] 2> 864768 WARN (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 864769 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 864770 WARN (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 864771 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 864776 WARN (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 864776 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 864779 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.s.IndexSchema [collection2] Schema name=tiny [junit4] 2> 864782 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 864784 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.CoreContainer Creating SolrCore 'collection2' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection2 [junit4] 2> 864784 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.SolrCore [[collection2] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection2], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection2/data/] [junit4] 2> 864785 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=43, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.4156172817436683] [junit4] 2> 864787 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=tiny [junit4] 2> 864789 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 864791 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection1 [junit4] 2> 864791 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection1], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection1/data/] [junit4] 2> 864792 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=43, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.4156172817436683] [junit4] 2> 864793 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.s.IndexSchema [collection5] Schema name=tiny [junit4] 2> 864795 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 864796 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.c.CoreContainer Creating SolrCore 'collection5' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection5 [junit4] 2> 864797 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.c.SolrCore [[collection5] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection5], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection5/data/] [junit4] 2> 864798 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=43, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.4156172817436683] [junit4] 2> 864804 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 864804 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 864804 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=25, maxMergedSegmentMB=7.060546875, floorSegmentMB=2.1123046875, forceMergeDeletesPctAllowed=21.449361920418045, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0 [junit4] 2> 864804 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.s.SolrIndexSearcher Opening [Searcher@1d372629[collection2] main] [junit4] 2> 864805 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection2/conf [junit4] 2> 864805 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 864805 INFO (coreLoadExecutor-3770-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.SolrCores Opening transient core collection2 [junit4] 2> 864805 INFO (searcherExecutor-3771-thread-1-processing-x:collection2) [ x:collection2] o.a.s.c.SolrCore [collection2] Registered new searcher Searcher@1d372629[collection2] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 864813 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 864813 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 864813 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=25, maxMergedSegmentMB=7.060546875, floorSegmentMB=2.1123046875, forceMergeDeletesPctAllowed=21.449361920418045, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0 [junit4] 2> 864814 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.s.SolrIndexSearcher Opening [Searcher@4dd4268c[collection5] main] [junit4] 2> 864814 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection5/conf [junit4] 2> 864814 INFO (coreLoadExecutor-3770-thread-3-processing-x:collection4) [ x:collection5] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 864815 INFO (searcherExecutor-3773-thread-1-processing-x:collection5) [ x:collection5] o.a.s.c.SolrCore [collection5] Registered new searcher Searcher@4dd4268c[collection5] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 864816 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 864816 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 864816 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=25, maxMergedSegmentMB=7.060546875, floorSegmentMB=2.1123046875, forceMergeDeletesPctAllowed=21.449361920418045, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0 [junit4] 2> 864817 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@818714c[collection1] main] [junit4] 2> 864817 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-002/collection1/conf [junit4] 2> 864817 INFO (coreLoadExecutor-3770-thread-1-processing-x:collection4) [ x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 864817 INFO (searcherExecutor-3772-thread-1-processing-x:collection1) [ x:collection1] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@818714c[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 864819 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection1 [junit4] 2> 864820 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 864920 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865020 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865120 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865220 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865320 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865421 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865521 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865621 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865721 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865821 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 865922 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866022 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866122 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866222 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866322 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866423 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866523 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866623 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866723 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866823 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 866923 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867024 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867124 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867224 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867324 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867424 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867525 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867625 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867725 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867825 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 867925 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868026 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868126 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868226 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868326 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868426 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868526 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868627 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868727 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868827 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 868927 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869027 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869127 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869228 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869328 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869428 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869528 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869628 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869729 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869829 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 869929 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870029 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870129 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870230 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870330 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870430 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870530 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870630 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870730 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870831 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 870931 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871031 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871131 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871231 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871332 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871432 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871532 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871632 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871732 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871833 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 871933 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872033 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872133 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872233 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872333 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872434 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872534 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872634 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872734 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872834 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 872935 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 873035 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 873135 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 873235 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore Core collection1 is not yet closed, waiting 100 ms before checking again. [junit4] 2> 873315 INFO (Thread-2040) [ x:collection4] o.a.s.c.SolrCore [collection1] CLOSING SolrCore org.apache.solr.core.SolrCore@79c59679 [junit4] 2> 873316 INFO (Thread-2040) [ x:collection4] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection1 [junit4] 2> 873335 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Shutting down CoreContainer instance=1127625440 [junit4] 2> 873336 INFO (coreCloseExecutor-3784-thread-1-processing-x:collection4) [ x:collection5] o.a.s.c.SolrCore [collection5] CLOSING SolrCore org.apache.solr.core.SolrCore@72efe722 [junit4] 2> 873337 INFO (coreCloseExecutor-3784-thread-1-processing-x:collection4) [ x:collection5] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection5 [junit4] 2> 873338 INFO (coreCloseExecutor-3784-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.SolrCore [collection2] CLOSING SolrCore org.apache.solr.core.SolrCore@30db1304 [junit4] 2> 873345 INFO (coreCloseExecutor-3784-thread-2-processing-x:collection4) [ x:collection2] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.core.collection2 [junit4] 2> 873345 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.m.SolrMetricManager Closing metric reporters for: solr.node [junit4] 2> 873345 INFO (TEST-TestLazyCores.testMidUseUnload-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.SolrTestCaseJ4 ###Ending testMidUseUnload [junit4] 2> 873347 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.SolrTestCaseJ4 ###Starting testCreateTransientFromAdmin [junit4] 2> 873372 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.UpdateShardHandler Creating UpdateShardHandler HTTP client with params: socketTimeout=600000&connTimeout=60000&retry=true [junit4] 2> 873373 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCores Allocating transient cache for 4 transient cores [junit4] 2> 873391 WARN (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 873391 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 873396 WARN (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 873397 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 873400 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.s.IndexSchema [collection5] Schema name=tiny [junit4] 2> 873417 WARN (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 873418 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 873418 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 873420 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.c.CoreContainer Creating SolrCore 'collection5' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection5 [junit4] 2> 873420 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.c.SolrCore [[collection5] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection5], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection5/data/] [junit4] 2> 873420 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=tiny [junit4] 2> 873421 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=43, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.4156172817436683] [junit4] 2> 873423 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 873425 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection1 [junit4] 2> 873425 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection1], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection1/data/] [junit4] 2> 873426 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=43, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.4156172817436683] [junit4] 2> 873426 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.s.IndexSchema [collection2] Schema name=tiny [junit4] 2> 873429 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 873430 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.CoreContainer Creating SolrCore 'collection2' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection2 [junit4] 2> 873431 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.SolrCore [[collection2] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection2], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection2/data/] [junit4] 2> 873432 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=43, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.4156172817436683] [junit4] 2> 873449 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 873449 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 873450 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=25, maxMergedSegmentMB=7.060546875, floorSegmentMB=2.1123046875, forceMergeDeletesPctAllowed=21.449361920418045, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0 [junit4] 2> 873451 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.s.SolrIndexSearcher Opening [Searcher@ff7caea[collection2] main] [junit4] 2> 873451 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection2/conf [junit4] 2> 873452 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 873452 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 873452 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 873452 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=25, maxMergedSegmentMB=7.060546875, floorSegmentMB=2.1123046875, forceMergeDeletesPctAllowed=21.449361920418045, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0 [junit4] 2> 873453 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.s.SolrIndexSearcher Opening [Searcher@1e588569[collection5] main] [junit4] 2> 873453 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection5/conf [junit4] 2> 873453 INFO (coreLoadExecutor-3791-thread-3-processing-x:collection4) [ x:collection5] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 873453 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 873453 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 873454 INFO (coreLoadExecutor-3791-thread-2-processing-x:collection4) [ x:collection2] o.a.s.c.SolrCores Opening transient core collection2 [junit4] 2> 873454 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=26, maxMergeAtOnceExplicit=25, maxMergedSegmentMB=7.060546875, floorSegmentMB=2.1123046875, forceMergeDeletesPctAllowed=21.449361920418045, segmentsPerTier=26.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0 [junit4] 2> 873454 INFO (searcherExecutor-3794-thread-1-processing-x:collection2) [ x:collection2] o.a.s.c.SolrCore [collection2] Registered new searcher Searcher@ff7caea[collection2] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 873454 INFO (searcherExecutor-3792-thread-1-processing-x:collection5) [ x:collection5] o.a.s.c.SolrCore [collection5] Registered new searcher Searcher@1e588569[collection5] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 873455 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@e05f4c7[collection1] main] [junit4] 2> 873455 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/collection1/conf [junit4] 2> 873455 INFO (coreLoadExecutor-3791-thread-1-processing-x:collection4) [ x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 873455 INFO (searcherExecutor-3793-thread-1-processing-x:collection1) [ x:collection1] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@e05f4c7[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 873464 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.h.a.CoreAdminOperation core create command loadOnStartup=true&transient=true&name=core1&action=CREATE&wt=xml [junit4] 2> 873472 WARN (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 873472 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 873481 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.IndexSchema [core1] Schema name=tiny [junit4] 2> 873484 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 873485 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Creating SolrCore 'core1' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/core1 [junit4] 2> 873486 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCore [[core1] ] Opening new SolrCore at [/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/core1], dataDir=[/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/core1/data/] [junit4] 2> 873488 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=42, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.0] [junit4] 2> 873501 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 873501 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 873502 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=42, maxMergeAtOnceExplicit=39, maxMergedSegmentMB=12.8271484375, floorSegmentMB=0.7578125, forceMergeDeletesPctAllowed=18.945970578729025, segmentsPerTier=42.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.0 [junit4] 2> 873502 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.SolrIndexSearcher Opening [Searcher@5735626e[core1] main] [junit4] 2> 873503 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1ABEF390C14AADF2-001/tempDir-003/core1/conf [junit4] 2> 873503 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 [junit4] 2> 873503 INFO (searcherExecutor-3805-thread-1-processing-x:collection4) [ x:collection4] o.a.s.c.SolrCore [core1] Registered new searcher Searcher@5735626e[core1] main{ExitableDirectoryReader(UninvertingDirectoryReader())} [junit4] 2> 873503 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrCores Opening transient core core1 [junit4] 2> 873504 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.h.a.CoreAdminOperation core create command loadOnStartup=false&transient=true&name=core2&action=CREATE&wt=xml [junit4] 2> 873511 WARN (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.Config Beginning with Solr 5.5, <mergePolicy> is deprecated, use <mergePolicyFactory> instead. [junit4] 2> 873512 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.SolrConfig Using Lucene MatchVersion: 6.5.0 [junit4] 2> 873520 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.IndexSchema [core2] Schema name=tiny [junit4] 2> 873523 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.s.IndexSchema Loaded schema tiny/1.1 with uniqueid field id [junit4] 2> 873525 INFO (TEST-TestLazyCores.testCreateTransientFromAdmin-seed#[1ABEF390C14AADF2]) [ x:collection4] o.a.s.c.CoreContainer Creating SolrCore 'core2' using configuration from instancedir /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J0/temp/solr.core.TestLazyCores_1 [...truncated too long message...] ResponseHeaderTest, TestManagedResourceStorage, TestPushWriter, TestEmbeddedSolrServerConstructors, TestCodecSupport, TestRemoteStreaming, TestLazyCores] [junit4] 2> NOTE: reproduce with: ant test -Dtestcase=TestLazyCores -Dtests.seed=1ABEF390C14AADF2 -Dtests.multiplier=2 -Dtests.slow=true -Dtests.locale=hi -Dtests.timezone=America/Argentina/La_Rioja -Dtests.asserts=true -Dtests.file.encoding=UTF-8 [junit4] ERROR 0.00s J0 | TestLazyCores (suite) <<< [junit4] > Throwable #1: java.lang.AssertionError: ObjectTracker found 5 object(s) that were not released!!! [MockDirectoryWrapper, MockDirectoryWrapper, SolrCore, MDCAwareThreadPoolExecutor, MockDirectoryWrapper] [junit4] > org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException [junit4] > at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) [junit4] > at org.apache.solr.core.CachingDirectoryFactory.get(CachingDirectoryFactory.java:347) [junit4] > at org.apache.solr.core.MetricsDirectoryFactory.get(MetricsDirectoryFactory.java:201) [junit4] > at org.apache.solr.core.SolrCore.initSnapshotMetaDataManager(SolrCore.java:479) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:884) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) [junit4] > at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) [junit4] > at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) [junit4] > at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) [junit4] > at java.util.concurrent.FutureTask.run(FutureTask.java:266) [junit4] > at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) [junit4] > at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) [junit4] > at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) [junit4] > at java.lang.Thread.run(Thread.java:745) [junit4] > org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException [junit4] > at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) [junit4] > at org.apache.solr.core.CachingDirectoryFactory.get(CachingDirectoryFactory.java:347) [junit4] > at org.apache.solr.core.MetricsDirectoryFactory.get(MetricsDirectoryFactory.java:201) [junit4] > at org.apache.solr.core.SolrCore.getNewIndexDir(SolrCore.java:348) [junit4] > at org.apache.solr.core.SolrCore.initIndex(SolrCore.java:673) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:890) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) [junit4] > at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) [junit4] > at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) [junit4] > at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) [junit4] > at java.util.concurrent.FutureTask.run(FutureTask.java:266) [junit4] > at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) [junit4] > at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) [junit4] > at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) [junit4] > at java.lang.Thread.run(Thread.java:745) [junit4] > org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException [junit4] > at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:980) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) [junit4] > at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) [junit4] > at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) [junit4] > at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) [junit4] > at java.util.concurrent.FutureTask.run(FutureTask.java:266) [junit4] > at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) [junit4] > at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) [junit4] > at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) [junit4] > at java.lang.Thread.run(Thread.java:745) [junit4] > org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException [junit4] > at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:830) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) [junit4] > at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) [junit4] > at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) [junit4] > at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) [junit4] > at java.util.concurrent.FutureTask.run(FutureTask.java:266) [junit4] > at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) [junit4] > at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) [junit4] > at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) [junit4] > at java.lang.Thread.run(Thread.java:745) [junit4] > org.apache.solr.common.util.ObjectReleaseTracker$ObjectTrackerException [junit4] > at org.apache.solr.common.util.ObjectReleaseTracker.track(ObjectReleaseTracker.java:43) [junit4] > at org.apache.solr.core.CachingDirectoryFactory.get(CachingDirectoryFactory.java:347) [junit4] > at org.apache.solr.core.MetricsDirectoryFactory.get(MetricsDirectoryFactory.java:201) [junit4] > at org.apache.solr.update.SolrIndexWriter.create(SolrIndexWriter.java:97) [junit4] > at org.apache.solr.core.SolrCore.initIndex(SolrCore.java:705) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:890) [junit4] > at org.apache.solr.core.SolrCore.<init>(SolrCore.java:807) [junit4] > at org.apache.solr.core.CoreContainer.create(CoreContainer.java:903) [junit4] > at org.apache.solr.core.CoreContainer.lambda$load$3(CoreContainer.java:554) [junit4] > at com.codahale.metrics.InstrumentedExecutorService$InstrumentedCallable.call(InstrumentedExecutorService.java:197) [junit4] > at java.util.concurrent.FutureTask.run(FutureTask.java:266) [junit4] > at org.apache.solr.common.util.ExecutorUtil$MDCAwareThreadPoolExecutor.lambda$execute$0(ExecutorUtil.java:229) [junit4] > at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142) [junit4] > at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) [junit4] > at java.lang.Thread.run(Thread.java:745) [junit4] > at __randomizedtesting.SeedInfo.seed([1ABEF390C14AADF2]:0) [junit4] > at org.apache.solr.SolrTestCaseJ4.teardownTestCases(SolrTestCaseJ4.java:269) [junit4] > at java.lang.Thread.run(Thread.java:745)Throwable #2: com.carrotsearch.randomizedtesting.ThreadLeakError: 1 thread leaked from SUITE scope at org.apache.solr.core.TestLazyCores: [junit4] > 1) Thread[id=7526, name=searcherExecutor-3954-thread-1, state=WAITING, group=TGRP-TestLazyCores] [junit4] > at sun.misc.Unsafe.park(Native Method) [junit4] > at java.util.concurrent.locks.LockSupport.park(LockSupport.java:175) [junit4] > at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2039) [junit4] > at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442) [junit4] > at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1067) [junit4] > at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1127) [junit4] > at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) [junit4] > at java.lang.Thread.run(Thread.java:745) [junit4] > at __randomizedtesting.SeedInfo.seed([1ABEF390C14AADF2]:0)Throwable #3: com.carrotsearch.randomizedtesting.ThreadLeakError: There are still zombie threads that couldn't be terminated: [junit4] > 1) Thread[id=7526, name=searcherExecutor-3954-thread-1, state=WAITING, group=TGRP-TestLazyCores] [junit4] > at sun.misc.Unsafe.park(Native Method) [junit4] > at java.util.concurrent.locks.LockSupport.park(LockSupport.java:175) [junit4] > at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2039) [junit4] > at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442) [junit4] > at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1067) [junit4] > at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1127) [junit4] > at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617) [junit4] > at java.lang.Thread.run(Thread.java:745) [junit4] > at __randomizedtesting.SeedInfo.seed([1ABEF390C14AADF2]:0) [junit4] Completed [261/681 (1!)] on J0 in 186.61s, 8 tests, 1 failure, 2 errors <<< FAILURES! [...truncated 63777 lines...]
--------------------------------------------------------------------- To unsubscribe, e-mail: dev-unsubscr...@lucene.apache.org For additional commands, e-mail: dev-h...@lucene.apache.org