You are viewing a plain text version of this content. The canonical link for it is here.
Posted to builds@lucene.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2020/05/15 13:17:54 UTC
[JENKINS] Lucene-Solr-Tests-8.5 - Build # 211 - Unstable
Build: https://builds.apache.org/job/Lucene-Solr-Tests-8.5/211/
1 tests failed.
FAILED: org.apache.solr.search.TestRecovery.stressLogReplay
Error Message:
mismatch: '44'!='45' @ response/numFound
Stack Trace:
java.lang.RuntimeException: mismatch: '44'!='45' @ response/numFound
at __randomizedtesting.SeedInfo.seed([C06FCFC715AC55B5:5C12C6EC23A42F7]:0)
at org.apache.solr.SolrTestCaseJ4.assertJQ(SolrTestCaseJ4.java:1099)
at org.apache.solr.SolrTestCaseJ4.assertJQ(SolrTestCaseJ4.java:1046)
at org.apache.solr.search.TestRecovery.stressLogReplay(TestRecovery.java:172)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.lang.Thread.run(Thread.java:748)
Build Log:
[...truncated 15775 lines...]
[junit4] Suite: org.apache.solr.search.TestRecovery
[junit4] 2> 2589853 INFO (SUITE-TestRecovery-seed#[C06FCFC715AC55B5]-worker) [ ] o.a.s.SolrTestCase Setting 'solr.default.confdir' system property to test-framework derived value of '/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/server/solr/configsets/_default/conf'
[junit4] 2> 2589853 INFO (SUITE-TestRecovery-seed#[C06FCFC715AC55B5]-worker) [ ] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
[junit4] 2> 2589853 INFO (SUITE-TestRecovery-seed#[C06FCFC715AC55B5]-worker) [ ] o.a.s.SolrTestCaseJ4 Created dataDir: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/build/solr-core/test/J1/temp/solr.search.TestRecovery_C06FCFC715AC55B5-001/data-dir-364-001
[junit4] 2> 2589853 WARN (SUITE-TestRecovery-seed#[C06FCFC715AC55B5]-worker) [ ] o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=20 numCloses=20
[junit4] 2> 2589853 INFO (SUITE-TestRecovery-seed#[C06FCFC715AC55B5]-worker) [ ] o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true) w/NUMERIC_DOCVALUES_SYSPROP=false
[junit4] 2> 2589855 INFO (SUITE-TestRecovery-seed#[C06FCFC715AC55B5]-worker) [ ] o.a.s.SolrTestCaseJ4 Randomized ssl (true) and clientAuth (true) via: @org.apache.solr.util.RandomizeSSL(reason=, ssl=NaN, value=NaN, clientAuth=NaN)
[junit4] 2> 2589857 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testLogReplayWithReorderedDBQUpdateWithDifferentChildCount
[junit4] 2> 2589858 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 updateLog impl=solr.UpdateLog
[junit4] 2> 2589858 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 ####initCore
[junit4] 2> 2589858 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib/classes]
[junit4] 2> 2589878 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.5.2
[junit4] 2> 2589891 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.IndexSchema [null] Schema name=test
[junit4] 2> 2589973 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.IndexSchema Loaded schema test/1.6 with uniqueid field id
[junit4] 2> 2590301 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.f.DistribPackageStore Unable to create [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore] directory in SOLR_HOME [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr]. Features requiring this directory may fail.
[junit4] 2> => java.security.AccessControlException: access denied ("java.io.FilePermission" "/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore" "write")
[junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472)
[junit4] 2> java.security.AccessControlException: access denied ("java.io.FilePermission" "/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore" "write")
[junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472) ~[?:1.8.0_191]
[junit4] 2> at java.security.AccessController.checkPermission(AccessController.java:884) ~[?:1.8.0_191]
[junit4] 2> at java.lang.SecurityManager.checkPermission(SecurityManager.java:549) ~[?:1.8.0_191]
[junit4] 2> at java.lang.SecurityManager.checkWrite(SecurityManager.java:979) ~[?:1.8.0_191]
[junit4] 2> at java.io.File.mkdir(File.java:1311) ~[?:1.8.0_191]
[junit4] 2> at java.io.File.mkdirs(File.java:1343) ~[?:1.8.0_191]
[junit4] 2> at org.apache.solr.filestore.DistribPackageStore.ensurePackageStoreDir(DistribPackageStore.java:520) ~[java/:?]
[junit4] 2> at org.apache.solr.filestore.DistribPackageStore.<init>(DistribPackageStore.java:77) ~[java/:?]
[junit4] 2> at org.apache.solr.filestore.PackageStoreAPI.<init>(PackageStoreAPI.java:79) ~[java/:?]
[junit4] 2> at org.apache.solr.core.CoreContainer.load(CoreContainer.java:634) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:180) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:143) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:149) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:112) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.createCore(SolrTestCaseJ4.java:806) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:796) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:657) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:646) ~[java/:?]
[junit4] 2> at org.apache.solr.search.TestRecovery.beforeTest(TestRecovery.java:80) ~[test/:?]
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) ~[?:1.8.0_191]
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62) ~[?:1.8.0_191]
[junit4] 2> at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:1.8.0_191]
[junit4] 2> at java.lang.reflect.Method.invoke(Method.java:498) ~[?:1.8.0_191]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:972) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 2590306 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
[junit4] 2> 2590306 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
[junit4] 2> 2590307 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@66745589[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2590307 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@66745589[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2590455 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
[junit4] 2> 2590455 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@1372184e[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2590455 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@1372184e[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2590457 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.CoreContainer Not all security plugins configured! authentication=disabled authorization=disabled. Solr is only as secure as you make it. Consider configuring authentication/authorization before exposing Solr to users internal or external. See https://s.apache.org/solrsecurity for more info
[junit4] 2> 2590474 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores
[junit4] 2> 2590474 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
[junit4] 2> 2590510 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2590524 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2590524 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2590704 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib/classes]
[junit4] 2> 2590747 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.5.2
[junit4] 2> 2590760 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema [collection1] Schema name=test
[junit4] 2> 2590874 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Loaded schema test/1.6 with uniqueid field id
[junit4] 2> 2590910 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1, trusted=true
[junit4] 2> 2590911 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2590911 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/build/solr-core/test/J1/temp/solr.search.TestRecovery_C06FCFC715AC55B5-001/data-dir-364-001/]
[junit4] 2> 2590915 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=23, maxMergeAtOnceExplicit=42, maxMergedSegmentMB=97.77734375, floorSegmentMB=1.5634765625, forceMergeDeletesPctAllowed=17.42607915281888, segmentsPerTier=34.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0, deletesPctAllowed=26.103408888989037
[junit4] 2> 2591193 WARN (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type = requestHandler,name = /dump,class = DumpRequestHandler,attributes = {initParams=a, name=/dump, class=DumpRequestHandler},args = {defaults={a=A,b=B}}}
[junit4] 2> 2591234 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 2591234 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 2591235 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 2591235 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 2591236 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: minMergeSize=1000, mergeFactor=30, maxMergeSize=9223372036854775807, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0]
[junit4] 2> 2591236 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.s.SolrIndexSearcher Opening [Searcher@10866ed4[collection1] main]
[junit4] 2> 2591236 WARN (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.r.ManagedResourceStorage Cannot write to config directory /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/conf; switching to use InMemory storage instead.
[junit4] 2> 2591237 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
[junit4] 2> 2591237 INFO (coreLoadExecutor-15001-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1666761201916313600
[junit4] 2> 2591239 INFO (searcherExecutor-15002-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@10866ed4[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 2591246 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 ####initCore end
[junit4] 2> 2591248 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.DirectUpdateHandler2 [collection1] REMOVING ALL DOCUMENTS FROM INDEX
[junit4] 2> 2591254 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.SolrIndexSearcher Opening [Searcher@15658587[collection1] realtime]
[junit4] 2> 2591254 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={_version_=-9223372036854775807&update.distrib=FROMLEADER&versions=true&wt=json&indent=true}{deleteByQuery=*:* (-9223372036854775807)} 0 6
[junit4] 2> 2591254 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.DirectUpdateHandler2 start commit{_version_=1666761201934139392,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 2591254 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.SolrIndexWriter Calling setCommitData with IW:org.apache.solr.update.SolrIndexWriter@6440fff5 commitCommandVersion:1666761201934139392
[junit4] 2> 2591270 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.SolrIndexSearcher Opening [Searcher@7d8d4e25[collection1] main]
[junit4] 2> 2591271 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.DirectUpdateHandler2 end_commit_flush
[junit4] 2> 2591274 INFO (searcherExecutor-15002-thread-1) [ ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@7d8d4e25[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 2591282 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={}{commit=} 0 27
[junit4] 2> 2591286 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={update.distrib=FROMLEADER&wt=json&indent=true}{add=[RDBQ5_1]} 0 1
[junit4] 2> 2591286 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={update.distrib=FROMLEADER&wt=json&indent=true}{add=[RDBQ5_1 (1)]} 0 0
[junit4] 2> 2591286 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={update.distrib=FROMLEADER&wt=json&indent=true}{add=[RDBQ5_2 (2)]} 0 0
[junit4] 2> 2591300 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.SolrIndexSearcher Opening [Searcher@691ee305[collection1] realtime]
[junit4] 2> 2591301 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={update.distrib=FROMLEADER&_version_=-4&wt=json&indent=true}{deleteByQuery=id:RDBQ5_3 (-4)} 0 14
[junit4] 2> 2591301 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.DirectUpdateHandler2 Reordered DBQs detected. Update=add{_version_=3,id=RDBQ5_2} DBQs=[DBQ{version=4,q=id:RDBQ5_3}]
[junit4] 2> 2591313 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.SolrIndexSearcher Opening [Searcher@7f083f52[collection1] realtime]
[junit4] 2> 2591313 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={update.distrib=FROMLEADER&wt=json&indent=true}{add=[RDBQ5_2 (3)]} 0 12
[junit4] 2> 2591313 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.S.Request [collection1] webapp=null path=null params={q=*:*&wt=xml} hits=0 status=0 QTime=0
[junit4] 2> 2591313 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=1091169233
[junit4] 2> 2591313 INFO (coreCloseExecutor-15007-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] CLOSING SolrCore org.apache.solr.core.SolrCore@2fc3fb1d
[junit4] 2> 2591313 INFO (coreCloseExecutor-15007-thread-1) [ x:collection1 ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection1, tag=SolrCore@2fc3fb1d
[junit4] 2> 2591313 INFO (coreCloseExecutor-15007-thread-1) [ x:collection1 ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@441a8e25: rootName = null, domain = solr.core.collection1, service url = null, agent id = null] for registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@397025cd
[junit4] 2> 2591345 INFO (coreCloseExecutor-15007-thread-1) [ x:collection1 ] o.a.s.u.TestInjection Inject failure: skipIndexWriterCommitOnClose=true: org.apache.solr.update.SolrIndexWriter@6440fff5
[junit4] 2> 2591345 WARN (coreCloseExecutor-15007-thread-1) [ x:collection1 ] o.a.s.u.DirectUpdateHandler2 Skipping commit for IndexWriter.close() due to TestInjection
[junit4] 2> 2591355 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null
[junit4] 2> 2591355 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@60225b05: rootName = null, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@6b3a65cc
[junit4] 2> 2591361 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null
[junit4] 2> 2591361 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@472eee56: rootName = null, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@36a7bb25
[junit4] 2> 2591363 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null
[junit4] 2> 2591363 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@3f669a27: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@45532aa4
[junit4] 2> 2591367 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib/classes]
[junit4] 2> 2591391 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.5.2
[junit4] 2> 2591439 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.IndexSchema [null] Schema name=test
[junit4] 2> 2591741 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.IndexSchema Loaded schema test/1.6 with uniqueid field id
[junit4] 2> 2592987 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.f.DistribPackageStore Unable to create [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore] directory in SOLR_HOME [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr]. Features requiring this directory may fail.
[junit4] 2> => java.security.AccessControlException: access denied ("java.io.FilePermission" "/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore" "write")
[junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472)
[junit4] 2> java.security.AccessControlException: access denied ("java.io.FilePermission" "/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore" "write")
[junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472) ~[?:1.8.0_191]
[junit4] 2> at java.security.AccessController.checkPermission(AccessController.java:884) ~[?:1.8.0_191]
[junit4] 2> at java.lang.SecurityManager.checkPermission(SecurityManager.java:549) ~[?:1.8.0_191]
[junit4] 2> at java.lang.SecurityManager.checkWrite(SecurityManager.java:979) ~[?:1.8.0_191]
[junit4] 2> at java.io.File.mkdir(File.java:1311) ~[?:1.8.0_191]
[junit4] 2> at java.io.File.mkdirs(File.java:1343) ~[?:1.8.0_191]
[junit4] 2> at org.apache.solr.filestore.DistribPackageStore.ensurePackageStoreDir(DistribPackageStore.java:520) ~[java/:?]
[junit4] 2> at org.apache.solr.filestore.DistribPackageStore.<init>(DistribPackageStore.java:77) ~[java/:?]
[junit4] 2> at org.apache.solr.filestore.PackageStoreAPI.<init>(PackageStoreAPI.java:79) ~[java/:?]
[junit4] 2> at org.apache.solr.core.CoreContainer.load(CoreContainer.java:634) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:180) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:143) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:149) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:112) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.createCore(SolrTestCaseJ4.java:806) ~[java/:?]
[junit4] 2> at org.apache.solr.search.TestRecovery.testLogReplayWithReorderedDBQWrapper(TestRecovery.java:509) ~[test/:?]
[junit4] 2> at org.apache.solr.search.TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount(TestRecovery.java:457) ~[test/:?]
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) ~[?:1.8.0_191]
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62) ~[?:1.8.0_191]
[junit4] 2> at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:1.8.0_191]
[junit4] 2> at java.lang.reflect.Method.invoke(Method.java:498) ~[?:1.8.0_191]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 2592989 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
[junit4] 2> 2592990 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
[junit4] 2> 2592990 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@283ddf59[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2592990 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@283ddf59[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2592996 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
[junit4] 2> 2593003 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@293d0446[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2593003 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@293d0446[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2593004 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.CoreContainer Not all security plugins configured! authentication=disabled authorization=disabled. Solr is only as secure as you make it. Consider configuring authentication/authorization before exposing Solr to users internal or external. See https://s.apache.org/solrsecurity for more info
[junit4] 2> 2593045 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores
[junit4] 2> 2593045 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
[junit4] 2> 2593066 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2593076 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2593077 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2593080 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib/classes]
[junit4] 2> 2593117 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.5.2
[junit4] 2> 2593152 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema [collection1] Schema name=test
[junit4] 2> 2593256 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Loaded schema test/1.6 with uniqueid field id
[junit4] 2> 2593264 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1, trusted=true
[junit4] 2> 2593264 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2593264 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/build/solr-core/test/J1/temp/solr.search.TestRecovery_C06FCFC715AC55B5-001/data-dir-364-001/]
[junit4] 2> 2593267 WARN (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type = requestHandler,name = /dump,class = DumpRequestHandler,attributes = {initParams=a, name=/dump, class=DumpRequestHandler},args = {defaults={a=A,b=B}}}
[junit4] 2> 2593561 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 2593561 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 2593562 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 2593562 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 2593570 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=23, maxMergeAtOnceExplicit=42, maxMergedSegmentMB=97.77734375, floorSegmentMB=1.5634765625, forceMergeDeletesPctAllowed=17.42607915281888, segmentsPerTier=34.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0, deletesPctAllowed=26.103408888989037
[junit4] 2> 2593572 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.s.SolrIndexSearcher Opening [Searcher@4e96d128[collection1] main]
[junit4] 2> 2593572 WARN (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.r.ManagedResourceStorage Cannot write to config directory /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/conf; switching to use InMemory storage instead.
[junit4] 2> 2593573 INFO (coreLoadExecutor-15017-thread-1) [ x:collection1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
[junit4] 2> 2593575 INFO (searcherExecutor-15018-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@4e96d128[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 2593575 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.S.Request [collection1] webapp=null path=null params={q=*:*&wt=xml} hits=0 status=0 QTime=0
[junit4] 2> 2593576 WARN (recoveryExecutor-15020-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.u.UpdateLog Starting log replay tlog{file=/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/build/solr-core/test/J1/temp/solr.search.TestRecovery_C06FCFC715AC55B5-001/data-dir-364-001/tlog/tlog.0000000000000000001 refcount=2} active=false starting pos=0 inSortedOrder=false
[junit4] 2> 2593846 INFO (recoveryExecutor-15020-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.s.SolrIndexSearcher Opening [Searcher@31860681[collection1] realtime]
[junit4] 2> 2593854 INFO (recoveryExecutor-15020-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.s.SolrIndexSearcher Opening [Searcher@66da301b[collection1] realtime]
[junit4] 2> 2593855 INFO (replayUpdatesExecutor-15011-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.u.DirectUpdateHandler2 Reordered DBQs detected. Update=add{flags=a,_version_=3,id=RDBQ5_2} DBQs=[DBQ{version=4,q=id:RDBQ5_3}]
[junit4] 2> 2593859 INFO (replayUpdatesExecutor-15011-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.s.SolrIndexSearcher Opening [Searcher@13485a42[collection1] realtime]
[junit4] 2> 2594104 INFO (recoveryExecutor-15020-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.u.DirectUpdateHandler2 start commit{flags=2,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 2594104 INFO (recoveryExecutor-15020-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.u.SolrIndexWriter Calling setCommitData with IW:org.apache.solr.update.SolrIndexWriter@182cb5d2 commitCommandVersion:0
[junit4] 2> 2594310 INFO (recoveryExecutor-15020-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.s.SolrIndexSearcher Opening [Searcher@495bf496[collection1] main]
[junit4] 2> 2594311 INFO (recoveryExecutor-15020-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.u.DirectUpdateHandler2 end_commit_flush
[junit4] 2> 2594314 INFO (searcherExecutor-15018-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@495bf496[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_3(8.5.2):c4:[diagnostics={os=Linux, java.version=1.8.0_191, os.arch=amd64, java.runtime.version=1.8.0_191-b12, source=merge, os.version=4.15.0-54-generic, java.vendor=Oracle Corporation, java.vm.version=25.191-b12, lucene.version=8.5.2, mergeMaxNumSegments=-1, mergeFactor=1, timestamp=1589547352467}]:[attributes={Lucene50StoredFieldsFormat.mode=BEST_SPEED}]) Uninverting(_4(8.5.2):c4:[diagnostics={os=Linux, java.vendor=Oracle Corporation, java.version=1.8.0_191, java.vm.version=25.191-b12, lucene.version=8.5.2, os.arch=amd64, java.runtime.version=1.8.0_191-b12, source=flush, os.version=4.15.0-54-generic, timestamp=1589547352470}]:[attributes={Lucene50StoredFieldsFormat.mode=BEST_SPEED}])))}
[junit4] 2> 2594315 INFO (recoveryExecutor-15020-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] {add=[RDBQ5_1, RDBQ5_1 (1), RDBQ5_2 (2), RDBQ5_2 (3)],deleteByQuery=id:RDBQ5_3 (-4)} 0 739
[junit4] 2> 2594315 WARN (recoveryExecutor-15020-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.u.UpdateLog Log replay finished. recoveryInfo=RecoveryInfo{adds=4 deletes=0 deleteByQuery=1 errors=0 positionOfStart=0}
[junit4] 2> 2594315 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.S.Request [collection1] webapp=null path=null params={q=*:*&wt=xml} hits=8 status=0 QTime=0
[junit4] 2> 2594316 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 ###deleteCore
[junit4] 2> 2594316 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=470622335
[junit4] 2> 2594316 INFO (coreCloseExecutor-15023-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] CLOSING SolrCore org.apache.solr.core.SolrCore@4d8a80d4
[junit4] 2> 2594316 INFO (coreCloseExecutor-15023-thread-1) [ x:collection1 ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection1, tag=SolrCore@4d8a80d4
[junit4] 2> 2594317 INFO (coreCloseExecutor-15023-thread-1) [ x:collection1 ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@5249b23: rootName = null, domain = solr.core.collection1, service url = null, agent id = null] for registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@6d1fa495
[junit4] 2> 2594330 INFO (coreCloseExecutor-15023-thread-1) [ x:collection1 ] o.a.s.u.DirectUpdateHandler2 Committing on IndexWriter.close() ... SKIPPED (unnecessary).
[junit4] 2> 2594338 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null
[junit4] 2> 2594338 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@5ab1d506: rootName = null, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@6c305b33
[junit4] 2> 2594347 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null
[junit4] 2> 2594347 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@20ba44c: rootName = null, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@36a7bb25
[junit4] 2> 2594356 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null
[junit4] 2> 2594356 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@693d22f7: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@45532aa4
[junit4] 2> 2594368 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQUpdateWithDifferentChildCount-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testLogReplayWithReorderedDBQUpdateWithDifferentChildCount
[junit4] 2> 2594372 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testLogReplayWithReorderedDBQInsertingChildnodes
[junit4] 2> 2594372 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 updateLog impl=solr.UpdateLog
[junit4] 2> 2594372 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 ####initCore
[junit4] 2> 2594372 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib/classes]
[junit4] 2> 2594440 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.5.2
[junit4] 2> 2594455 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 Created dataDir: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/build/solr-core/test/J1/temp/solr.search.TestRecovery_C06FCFC715AC55B5-001/data-dir-365-001
[junit4] 2> 2594459 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.IndexSchema [null] Schema name=test
[junit4] 2> 2594704 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.IndexSchema Loaded schema test/1.6 with uniqueid field id
[junit4] 2> 2597712 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.f.DistribPackageStore Unable to create [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore] directory in SOLR_HOME [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr]. Features requiring this directory may fail.
[junit4] 2> => java.security.AccessControlException: access denied ("java.io.FilePermission" "/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore" "write")
[junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472)
[junit4] 2> java.security.AccessControlException: access denied ("java.io.FilePermission" "/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore" "write")
[junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472) ~[?:1.8.0_191]
[junit4] 2> at java.security.AccessController.checkPermission(AccessController.java:884) ~[?:1.8.0_191]
[junit4] 2> at java.lang.SecurityManager.checkPermission(SecurityManager.java:549) ~[?:1.8.0_191]
[junit4] 2> at java.lang.SecurityManager.checkWrite(SecurityManager.java:979) ~[?:1.8.0_191]
[junit4] 2> at java.io.File.mkdir(File.java:1311) ~[?:1.8.0_191]
[junit4] 2> at java.io.File.mkdirs(File.java:1343) ~[?:1.8.0_191]
[junit4] 2> at org.apache.solr.filestore.DistribPackageStore.ensurePackageStoreDir(DistribPackageStore.java:520) ~[java/:?]
[junit4] 2> at org.apache.solr.filestore.DistribPackageStore.<init>(DistribPackageStore.java:77) ~[java/:?]
[junit4] 2> at org.apache.solr.filestore.PackageStoreAPI.<init>(PackageStoreAPI.java:79) ~[java/:?]
[junit4] 2> at org.apache.solr.core.CoreContainer.load(CoreContainer.java:634) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:180) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:143) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:149) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:112) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.createCore(SolrTestCaseJ4.java:806) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:796) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:657) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:646) ~[java/:?]
[junit4] 2> at org.apache.solr.search.TestRecovery.beforeTest(TestRecovery.java:80) ~[test/:?]
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) ~[?:1.8.0_191]
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62) ~[?:1.8.0_191]
[junit4] 2> at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:1.8.0_191]
[junit4] 2> at java.lang.reflect.Method.invoke(Method.java:498) ~[?:1.8.0_191]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:972) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 2597712 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
[junit4] 2> 2597713 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
[junit4] 2> 2597713 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@5c39bc90[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2597713 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@5c39bc90[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2597716 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
[junit4] 2> 2597718 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@3606a838[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2597718 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@3606a838[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 2597719 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.CoreContainer Not all security plugins configured! authentication=disabled authorization=disabled. Solr is only as secure as you make it. Consider configuring authentication/authorization before exposing Solr to users internal or external. See https://s.apache.org/solrsecurity for more info
[junit4] 2> 2597733 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores
[junit4] 2> 2597733 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
[junit4] 2> 2597760 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2597767 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2597767 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2597768 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib/classes]
[junit4] 2> 2597792 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.5.2
[junit4] 2> 2597805 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema [collection1] Schema name=test
[junit4] 2> 2597889 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Loaded schema test/1.6 with uniqueid field id
[junit4] 2> 2597895 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1, trusted=true
[junit4] 2> 2597896 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@6d1b8d51
[junit4] 2> 2597896 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/build/solr-core/test/J1/temp/solr.search.TestRecovery_C06FCFC715AC55B5-001/data-dir-365-001/]
[junit4] 2> 2597897 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=23, maxMergeAtOnceExplicit=42, maxMergedSegmentMB=97.77734375, floorSegmentMB=1.5634765625, forceMergeDeletesPctAllowed=17.42607915281888, segmentsPerTier=34.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0, deletesPctAllowed=26.103408888989037
[junit4] 2> 2597912 WARN (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type = requestHandler,name = /dump,class = DumpRequestHandler,attributes = {initParams=a, name=/dump, class=DumpRequestHandler},args = {defaults={a=A,b=B}}}
[junit4] 2> 2597946 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 2597946 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 2597947 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
[junit4] 2> 2597947 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 2597948 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: minMergeSize=1000, mergeFactor=30, maxMergeSize=9223372036854775807, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0]
[junit4] 2> 2597948 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.s.SolrIndexSearcher Opening [Searcher@1bfc0cc6[collection1] main]
[junit4] 2> 2597949 WARN (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.r.ManagedResourceStorage Cannot write to config directory /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/conf; switching to use InMemory storage instead.
[junit4] 2> 2597949 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
[junit4] 2> 2597949 INFO (coreLoadExecutor-15033-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1666761208954355712
[junit4] 2> 2597951 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.SolrTestCaseJ4 ####initCore end
[junit4] 2> 2597951 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.DirectUpdateHandler2 [collection1] REMOVING ALL DOCUMENTS FROM INDEX
[junit4] 2> 2597953 INFO (searcherExecutor-15034-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@1bfc0cc6[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 2597953 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.SolrIndexSearcher Opening [Searcher@161fea8c[collection1] realtime]
[junit4] 2> 2597953 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={_version_=-9223372036854775807&update.distrib=FROMLEADER&versions=true&wt=json&indent=true}{deleteByQuery=*:* (-9223372036854775807)} 0 1
[junit4] 2> 2597953 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.DirectUpdateHandler2 start commit{_version_=1666761208958550016,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 2597953 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.SolrIndexWriter Calling setCommitData with IW:org.apache.solr.update.SolrIndexWriter@82a5305 commitCommandVersion:1666761208958550016
[junit4] 2> 2597966 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.SolrIndexSearcher Opening [Searcher@21dac742[collection1] main]
[junit4] 2> 2597967 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.DirectUpdateHandler2 end_commit_flush
[junit4] 2> 2597971 INFO (searcherExecutor-15034-thread-1) [ ] o.a.s.c.SolrCore [collection1] Registered new searcher Searcher@21dac742[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 2597971 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={}{commit=} 0 18
[junit4] 2> 2597973 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={update.distrib=FROMLEADER&_version_=-6&wt=json&indent=true}{deleteByQuery=id:RDBQ4_2 (-6)} 0 0
[junit4] 2> 2597973 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.DirectUpdateHandler2 Reordered DBQs detected. Update=add{_version_=5,id=RDBQ4_1} DBQs=[DBQ{version=6,q=id:RDBQ4_2}]
[junit4] 2> 2597982 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.SolrIndexSearcher Opening [Searcher@63ee9f5[collection1] realtime]
[junit4] 2> 2597983 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.u.p.LogUpdateProcessorFactory [collection1] webapp=null path=null params={update.distrib=FROMLEADER&wt=json&indent=true}{add=[RDBQ4_1 (5)]} 0 9
[junit4] 2> 2597983 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.S.Request [collection1] webapp=null path=null params={q=*:*&wt=xml} hits=0 status=0 QTime=0
[junit4] 2> 2597983 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=501943101
[junit4] 2> 2597983 INFO (coreCloseExecutor-15039-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] CLOSING SolrCore org.apache.solr.core.SolrCore@5698f3f4
[junit4] 2> 2597983 INFO (coreCloseExecutor-15039-thread-1) [ x:collection1 ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection1, tag=SolrCore@5698f3f4
[junit4] 2> 2597983 INFO (coreCloseExecutor-15039-thread-1) [ x:collection1 ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@2be97971: rootName = null, domain = solr.core.collection1, service url = null, agent id = null] for registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@2cdaeb3f
[junit4] 2> 2597996 INFO (coreCloseExecutor-15039-thread-1) [ x:collection1 ] o.a.s.u.TestInjection Inject failure: skipIndexWriterCommitOnClose=true: org.apache.solr.update.SolrIndexWriter@82a5305
[junit4] 2> 2597996 WARN (coreCloseExecutor-15039-thread-1) [ x:collection1 ] o.a.s.u.DirectUpdateHandler2 Skipping commit for IndexWriter.close() due to TestInjection
[junit4] 2> 2597998 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null
[junit4] 2> 2597998 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@7fd99e67: rootName = null, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@9d018cd
[junit4] 2> 2598004 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null
[junit4] 2> 2598004 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@2e7354c: rootName = null, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@36a7bb25
[junit4] 2> 2598006 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null
[junit4] 2> 2598006 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@66a86782: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@45532aa4
[junit4] 2> 2598007 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.SolrResourceLoader [null] Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/collection1/lib/classes]
[junit4] 2> 2598028 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.5.2
[junit4] 2> 2598042 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.IndexSchema [null] Schema name=test
[junit4] 2> 2598118 INFO (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.s.IndexSchema Loaded schema test/1.6 with uniqueid field id
[junit4] 2> 2598709 WARN (TEST-TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes-seed#[C06FCFC715AC55B5]) [ ] o.a.s.f.DistribPackageStore Unable to create [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore] directory in SOLR_HOME [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr]. Features requiring this directory may fail.
[junit4] 2> => java.security.AccessControlException: access denied ("java.io.FilePermission" "/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore" "write")
[junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472)
[junit4] 2> java.security.AccessControlException: access denied ("java.io.FilePermission" "/home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/core/src/test-files/solr/filestore" "write")
[junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472) ~[?:1.8.0_191]
[junit4] 2> at java.security.AccessController.checkPermission(AccessController.java:884) ~[?:1.8.0_191]
[junit4] 2> at java.lang.SecurityManager.checkPermission(SecurityManager.java:549) ~[?:1.8.0_191]
[junit4] 2> at java.lang.SecurityManager.checkWrite(SecurityManager.java:979) ~[?:1.8.0_191]
[junit4] 2> at java.io.File.mkdir(File.java:1311) ~[?:1.8.0_191]
[junit4] 2> at java.io.File.mkdirs(File.java:1343) ~[?:1.8.0_191]
[junit4] 2> at org.apache.solr.filestore.DistribPackageStore.ensurePackageStoreDir(DistribPackageStore.java:520) ~[java/:?]
[junit4] 2> at org.apache.solr.filestore.DistribPackageStore.<init>(DistribPackageStore.java:77) ~[java/:?]
[junit4] 2> at org.apache.solr.filestore.PackageStoreAPI.<init>(PackageStoreAPI.java:79) ~[java/:?]
[junit4] 2> at org.apache.solr.core.CoreContainer.load(CoreContainer.java:634) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:180) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:143) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:149) ~[java/:?]
[junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:112) ~[java/:?]
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.createCore(SolrTestCaseJ4.java:806) ~[java/:?]
[junit4] 2> at org.apache.solr.search.TestRecovery.testLogReplayWithReorderedDBQWrapper(TestRecovery.java:509) ~[test/:?]
[junit4] 2> at org.apache.solr.search.TestRecovery.testLogReplayWithReorderedDBQInsertingChildnodes(TestRecovery.java:441) ~[test/:?]
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) ~[?:1.8.0_191]
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62) ~[?:1.8.0_191]
[junit4] 2> at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:1.8.0_191]
[junit4] 2> at java.lang.reflect.Method.invoke(Method.java:498) ~[?:1.8.0_191]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64) ~[java/:?]
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41) ~[java/:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) ~[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at com.carrotsearch.randomizedtes
[...truncated too long message...]
itting on IndexWriter.close() .
[junit4] 2> 2673519 INFO (coreCloseExecutor-15715-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.u.SolrIndexWriter Calling setCommitData with IW:org.apache.solr.update.SolrIndexWriter@496d9a89 commitCommandVersion:0
[junit4] 2> 2673564 INFO (TEST-TestRecovery.testReload-seed#[C06FCFC715AC55B5]) [ x:collection1 ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null
[junit4] 2> 2673564 INFO (TEST-TestRecovery.testReload-seed#[C06FCFC715AC55B5]) [ x:collection1 ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@60cb9286: rootName = null, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@1c021336
[junit4] 2> 2673570 INFO (TEST-TestRecovery.testReload-seed#[C06FCFC715AC55B5]) [ x:collection1 ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null
[junit4] 2> 2673570 INFO (TEST-TestRecovery.testReload-seed#[C06FCFC715AC55B5]) [ x:collection1 ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@770359e3: rootName = null, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@36a7bb25
[junit4] 2> 2673573 INFO (TEST-TestRecovery.testReload-seed#[C06FCFC715AC55B5]) [ x:collection1 ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null
[junit4] 2> 2673573 INFO (TEST-TestRecovery.testReload-seed#[C06FCFC715AC55B5]) [ x:collection1 ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@14155c83: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@45532aa4
[junit4] 2> 2673574 INFO (TEST-TestRecovery.testReload-seed#[C06FCFC715AC55B5]) [ x:collection1 ] o.a.s.SolrTestCaseJ4 ###Ending testReload
[junit4] 2> NOTE: leaving temporary files on disk at: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/solr/build/solr-core/test/J1/temp/solr.search.TestRecovery_C06FCFC715AC55B5-001
[junit4] 2> NOTE: test params are: codec=Asserting(Lucene84): {_root_=BlockTreeOrds(blocksize=128), id=PostingsFormat(name=LuceneFixedGap)}, docValues:{_version_=DocValuesFormat(name=Direct), val_i=DocValuesFormat(name=Lucene80), val_i_dvo=DocValuesFormat(name=Lucene80), _root_=DocValuesFormat(name=Direct), id=DocValuesFormat(name=Lucene80)}, maxPointsInLeafNode=1116, maxMBSortInHeap=6.570302485927731, sim=Asserting(org.apache.lucene.search.similarities.AssertingSimilarity@18dcbe60), locale=is, timezone=Pacific/Majuro
[junit4] 2> NOTE: Linux 4.15.0-54-generic amd64/Oracle Corporation 1.8.0_191 (64-bit)/cpus=4,threads=1,free=143933464,total=531628032
[junit4] 2> NOTE: All tests run in this JVM: [TestSolrCloudWithSecureImpersonation, TestMergePolicyConfig, TestDownShardTolerantSearch, TestFilteredDocIdSet, TestOrdValues, TestRequestStatusCollectionAPI, TestPrepRecovery, UtilsToolTest, ReplaceNodeNoTargetTest, TestDeprecatedFilters, CategoryRoutedAliasUpdateProcessorTest, ClusterStateUpdateTest, TestUpdate, ByteBuffersDirectoryFactoryTest, SuggesterTest, TestOverriddenPrefixQueryForCustomFieldType, TestSkipOverseerOperations, TestComplexPhraseLeadingWildcard, TestCoreDiscovery, ChaosMonkeySafeLeaderWithPullReplicasTest, TestDeleteCollectionOnDownNodes, HighlighterTest, CoreAdminRequestStatusTest, TestTrackingShardHandlerFactory, SignificantTermsQParserPluginTest, DistributedMLTComponentTest, RestartWhileUpdatingTest, TestExpandComponent, UninvertDocValuesMergePolicyTest, TestJsonFacets, PackageManagerCLITest, TestHdfsCloudBackupRestore, OverriddenZkACLAndCredentialsProvidersTest, TestExportTool, SolrLogAuditLoggerPluginTest, TestAuthenticationFramework, SmileWriterTest, ExplicitHLLTest, TestRawResponseWriter, JsonLoaderTest, TestSimGenericDistributedQueue, TestCollationField, TestDynamicFieldCollectionResource, BigEndianAscendingWordDeserializerTest, TestLegacyTerms, PathHierarchyTokenizerFactoryTest, TestSchemaVersionResource, NodeLostTriggerIntegrationTest, ConnectionManagerTest, ChangedSchemaMergeTest, TestRandomFaceting, TestAnalyzedSuggestions, SegmentsInfoRequestHandlerTest, HdfsCollectionsAPIDistributedZkTest, SolrRrdBackendFactoryTest, BJQFilterAccessibleTest, TestHashPartitioner, TestMacroExpander, PreAnalyzedFieldTest, AlternateDirectoryTest, TestDocTermOrds, TestSolrTestCaseJ4, JWTVerificationkeyResolverTest, TestFaceting, TolerantUpdateProcessorTest, SolrCLIZkUtilsTest, OverseerRolesTest, DebugComponentTest, DistributedFacetPivotSmallAdvancedTest, LeaderTragicEventTest, MoveReplicaTest, NoCacheHeaderTest, HdfsAutoAddReplicasIntegrationTest, TestSmileRequest, TestSearchPerf, SchemaApiFailureTest, TestLRUStatsCache, TestSchemaNameResource, VMParamsZkACLAndCredentialsProvidersTest, CSVRequestHandlerTest, JWTAuthPluginIntegrationTest, CollectionsAPIDistributedZkTest, ManagedSchemaRoundRobinCloudTest, TestManagedStopFilterFactory, TestSimTriggerIntegration, CdcrVersionReplicationTest, TestLegacyNumericRangeQueryBuilder, DimensionalRoutedAliasUpdateProcessorTest, SplitShardTest, SolrSlf4jReporterTest, TestXIncludeConfig, TestInPlaceUpdatesStandalone, SolrMetricManagerTest, TestSubQueryTransformerDistrib, TestTestInjection, CdcrOpsAndBoundariesTest, TestApiFramework, MetricTriggerTest, HttpPartitionWithTlogReplicasTest, LukeRequestHandlerTest, TestObjectReleaseTracker, ResponseBuilderTest, BasicDistributedZk2Test, CloudReplicaSourceTest, TestEmbeddedSolrServerAdminHandler, TriggerEventQueueTest, TestDistribIDF, DisMaxRequestHandlerTest, RestoreTriggerStateTest, TestQueryingOnDownCollection, TestSQLHandler, SuggestComponentContextFilterQueryTest, ForceLeaderTest, TestCustomDocTransformer, DateFieldTest, TestLockTree, TestImpersonationWithHadoopAuth, SolrIndexConfigTest, TestCloudJSONFacetJoinDomain, TestSolrCachePerf, BaseCdcrDistributedZkTest, TestSchemaManager, TestFieldResource, TestHighlightDedupGrouping, TestSweetSpotSimilarityFactory, TlogReplayBufferedWhileIndexingTest, QueryParsingTest, ConjunctionSolrSpellCheckerTest, HdfsChaosMonkeySafeLeaderTest, ZkCollectionPropsCachingTest, TermVectorComponentTest, BufferStoreTest, DeleteReplicaTest, SpatialRPTFieldTypeTest, UUIDFieldTest, TestHdfsBackupRestoreCore, TestStandardQParsers, CoreAdminCreateDiscoverTest, ShardsWhitelistTest, WordBreakSolrSpellCheckerTest, CloudExitableDirectoryReaderTest, TestConfigSetProperties, TestExtendedDismaxParser, CurrencyRangeFacetCloudTest, TestDFISimilarityFactory, HdfsRecoveryZkTest, V2ApiIntegrationTest, AnalysisAfterCoreReloadTest, BasicFunctionalityTest, ConvertedLegacyTest, CursorPagingTest, EchoParamsTest, MinimalSchemaTest, OutputWriterTest, SolrInfoBeanTest, SolrTestCaseJ4Test, TestCrossCoreJoin, TestCursorMarkWithoutUniqueKey, TestDistributedGrouping, TestDistributedSearch, TestDocumentBuilder, TestTrie, TestCharFilters, TestReversedWildcardFilterFactory, TestWordDelimiterFilterFactory, TokenizerChainTest, TestLuceneIndexBackCompat, ChaosMonkeyNothingIsSafeTest, ChaosMonkeySafeLeaderTest, CleanupOldIndexTest, ConcurrentCreateRoutedAliasTest, ConfigSetsAPITest, DeleteInactiveReplicaTest, DeleteLastCustomShardedReplicaTest, DeleteStatusTest, DistribCursorPagingTest, DistribDocExpirationUpdateProcessorTest, LeaderElectionIntegrationTest, MetricsHistoryIntegrationTest, MetricsHistoryWithAuthIntegrationTest, MigrateRouteKeyTest, RecoveryZkTest, RoutingToNodesWithPropertiesTest, SharedFSAutoReplicaFailoverTest, SolrXmlInZkTest, TestCloudInspectUtil, TestCloudPhrasesIdentificationComponent, TestCloudPseudoReturnFields, TestCloudRecovery2, TestClusterProperties, TestConfigSetsAPIExclusivity, TestConfigSetsAPIZkFailure, TestDistributedMap, TestExclusionRuleCollectionAccess, TestLeaderElectionZkExpiry, TestRequestForwarding, TestSegmentSorting, TestStressInPlaceUpdates, TestTolerantUpdateProcessorCloud, TestTolerantUpdateProcessorRandomCloud, TestUtilizeNode, TestWaitForStateWithJettyShutdowns, TestWithCollection, ZkFailoverTest, AssignTest, CollectionReloadTest, CollectionTooManyReplicasTest, TestCollectionAPI, AutoScalingHandlerTest, IndexSizeTriggerSizeEstimationTest, TestPolicyCloud, HdfsTlogReplayBufferedWhileIndexingTest, HdfsUnloadDistributedZkTest, HdfsWriteToMultipleCollectionsTest, StressHdfsTest, TestClusterStateMutator, ZkStateWriterTest, SolrCoreCheckLockOnStartupTest, TestBackupRepositoryFactory, TestBadConfig, TestDirectoryFactory, TestDynamicLoading, TestSolrXml, TestSolrCloudSnapshots, TestConfigReload, TestStressThreadBackup, TestSystemCollAutoCreate, InfoHandlerTest, MetricsHistoryHandlerTest, DistributedExpandComponentTest, DistributedFacetExistsSmallTest, DistributedFacetPivotLargeTest, DistributedSpellCheckComponentTest, SearchHandlerTest, Tagger2Test, HighlighterConfigTest, TestUnifiedSolrHighlighter, TestSlowCompositeReaderWrapper, TestLegacyField, TestLegacyFieldReuse, TestNumericRangeQuery32, TestNumericTokenStream, TestLogWatcher, JvmMetricsTest, SolrCoreMetricManagerTest, SolrJmxReporterTest, SubstringBytesRefFilterTest, TestFacetMethods, TestStreamBody, TestWriterPerf, TestRetrieveFieldsOptimizer, TestChildDocTransformerHierarchy, TestSubQueryTransformer, TestRestManager, TestCopyFieldCollectionResource, TestFieldTypeResource, TestUniqueKeyFieldResource, BadCopyFieldTest, BadIndexSchemaTest, DocValuesMultiTest, EnumFieldTest, ExternalFileFieldSortTest, IndexSchemaRuntimeFieldTest, IndexSchemaTest, NumericFieldsTest, TestBinaryField, TestCloudManagedSchema, TestManagedSchema, FuzzySearchTest, LargeFieldTest, MergeStrategyTest, TestDocSet, TestFoldingMultitermQuery, TestHashQParserPlugin, TestInitQParser, TestLFUCache, TestReRankQParserPlugin, TestRecovery]
[junit4] Completed [789/901 (1!)] on J1 in 83.77s, 20 tests, 1 error <<< FAILURES!
[...truncated 52923 lines...]
[JENKINS] Lucene-Solr-Tests-8.5 - Build # 214 - Still Unstable
Posted by Apache Jenkins Server <je...@builds.apache.org>.
Build: https://builds.apache.org/job/Lucene-Solr-Tests-8.5/214/
1 tests failed.
FAILED: org.apache.lucene.index.TestBackwardsCompatibility.testAllVersionsTested
Error Message:
Extra backcompat test files: 7.7.3-cfs
Stack Trace:
java.lang.AssertionError: Extra backcompat test files:
7.7.3-cfs
at __randomizedtesting.SeedInfo.seed([5E2C26BD8921FA14:4EF3C9FD3DB6EC38]:0)
at org.junit.Assert.fail(Assert.java:88)
at org.apache.lucene.index.TestBackwardsCompatibility.testAllVersionsTested(TestBackwardsCompatibility.java:706)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.lang.Thread.run(Thread.java:748)
Build Log:
[...truncated 5469 lines...]
[junit4] Suite: org.apache.lucene.index.TestBackwardsCompatibility
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateMoreTermsIndex
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateNoCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateEmptyIndex
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateSortedIndex
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateSingleSegmentCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateSingleSegmentNoCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateIndexWithDocValuesUpdates
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] 2> NOTE: reproduce with: ant test -Dtestcase=TestBackwardsCompatibility -Dtests.method=testAllVersionsTested -Dtests.seed=5E2C26BD8921FA14 -Dtests.multiplier=2 -Dtests.slow=true -Dtests.locale=sl -Dtests.timezone=Asia/Tbilisi -Dtests.asserts=true -Dtests.file.encoding=US-ASCII
[junit4] FAILURE 0.00s J0 | TestBackwardsCompatibility.testAllVersionsTested <<<
[junit4] > Throwable #1: java.lang.AssertionError: Extra backcompat test files:
[junit4] > 7.7.3-cfs
[junit4] > at __randomizedtesting.SeedInfo.seed([5E2C26BD8921FA14:4EF3C9FD3DB6EC38]:0)
[junit4] > at org.apache.lucene.index.TestBackwardsCompatibility.testAllVersionsTested(TestBackwardsCompatibility.java:706)
[junit4] > at java.lang.Thread.run(Thread.java:748)
[junit4] 2> NOTE: leaving temporary files on disk at: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/lucene/build/backward-codecs/test/J0/temp/lucene.index.TestBackwardsCompatibility_5E2C26BD8921FA14-001
[junit4] 2> NOTE: test params are: codec=FastDecompressionCompressingStoredFieldsData(storedFieldsFormat=CompressingStoredFieldsFormat(compressionMode=FAST_DECOMPRESSION, chunkSize=3, maxDocsPerChunk=468, blockShift=2), termVectorsFormat=CompressingTermVectorsFormat(compressionMode=FAST_DECOMPRESSION, chunkSize=3, blockSize=2)), sim=Asserting(org.apache.lucene.search.similarities.AssertingSimilarity@4b1d34ba), locale=sl, timezone=Asia/Tbilisi
[junit4] 2> NOTE: Linux 4.4.0-170-generic amd64/Oracle Corporation 1.8.0_191 (64-bit)/cpus=8,threads=1,free=410460200,total=496500736
[junit4] 2> NOTE: All tests run in this JVM: [TestBlockPostingsFormat, TestManyPointsInOldIndex, TestBackwardsCompatibility]
[junit4] Completed [8/10 (1!)] on J0 in 40.70s, 33 tests, 1 failure, 8 skipped <<< FAILURES!
[...truncated 63204 lines...]
[JENKINS] Lucene-Solr-Tests-8.5 - Build # 213 - Still Unstable
Posted by Apache Jenkins Server <je...@builds.apache.org>.
Build: https://builds.apache.org/job/Lucene-Solr-Tests-8.5/213/
1 tests failed.
FAILED: org.apache.lucene.index.TestBackwardsCompatibility.testAllVersionsTested
Error Message:
Extra backcompat test files: 7.7.3-cfs
Stack Trace:
java.lang.AssertionError: Extra backcompat test files:
7.7.3-cfs
at __randomizedtesting.SeedInfo.seed([44BE71776DAC18E2:54619E37D93B0ECE]:0)
at org.junit.Assert.fail(Assert.java:88)
at org.apache.lucene.index.TestBackwardsCompatibility.testAllVersionsTested(TestBackwardsCompatibility.java:706)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.lang.Thread.run(Thread.java:748)
Build Log:
[...truncated 5473 lines...]
[junit4] Suite: org.apache.lucene.index.TestBackwardsCompatibility
[junit4] 2> NOTE: reproduce with: ant test -Dtestcase=TestBackwardsCompatibility -Dtests.method=testAllVersionsTested -Dtests.seed=44BE71776DAC18E2 -Dtests.multiplier=2 -Dtests.slow=true -Dtests.locale=es-PR -Dtests.timezone=Europe/Sarajevo -Dtests.asserts=true -Dtests.file.encoding=ISO-8859-1
[junit4] FAILURE 0.00s J0 | TestBackwardsCompatibility.testAllVersionsTested <<<
[junit4] > Throwable #1: java.lang.AssertionError: Extra backcompat test files:
[junit4] > 7.7.3-cfs
[junit4] > at __randomizedtesting.SeedInfo.seed([44BE71776DAC18E2:54619E37D93B0ECE]:0)
[junit4] > at org.apache.lucene.index.TestBackwardsCompatibility.testAllVersionsTested(TestBackwardsCompatibility.java:706)
[junit4] > at java.lang.Thread.run(Thread.java:748)
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateIndexWithDocValuesUpdates
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateNoCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateMoreTermsIndex
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateEmptyIndex
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateSingleSegmentCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateSortedIndex
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateSingleSegmentNoCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J0 | TestBackwardsCompatibility.testCreateCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] 2> NOTE: leaving temporary files on disk at: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/lucene/build/backward-codecs/test/J0/temp/lucene.index.TestBackwardsCompatibility_44BE71776DAC18E2-001
[junit4] 2> NOTE: test params are: codec=Asserting(Lucene84): {content6=PostingsFormat(name=LuceneVarGapFixedInterval), content5=BlockTreeOrds(blocksize=128), content4=TestBloomFilteredLucenePostings(BloomFilteringPostingsFormat(Lucene84)), content3=FST50, content2=PostingsFormat(name=LuceneVarGapFixedInterval), fie?ld=PostingsFormat(name=LuceneVarGapFixedInterval), utf8=TestBloomFilteredLucenePostings(BloomFilteringPostingsFormat(Lucene84)), id=PostingsFormat(name=LuceneVarGapFixedInterval), content=TestBloomFilteredLucenePostings(BloomFilteringPostingsFormat(Lucene84)), autf8=FST50}, docValues:{ndv2=DocValuesFormat(name=Lucene80), ndv1=DocValuesFormat(name=Direct), __soft_delete=DocValuesFormat(name=Lucene80), utf8=DocValuesFormat(name=Direct), fie?ld=DocValuesFormat(name=Asserting), dvShort=DocValuesFormat(name=Lucene80), dvInt=DocValuesFormat(name=Direct), longPoint2d=DocValuesFormat(name=Lucene80), dvBytesSortedVar=DocValuesFormat(name=Asserting), dvSortedSet=DocValuesFormat(name=Asserting), content=DocValuesFormat(name=Direct), floatPoint1d=DocValuesFormat(name=Asserting), new_numeric=DocValuesFormat(name=Lucene80), bdv2=DocValuesFormat(name=Lucene80), bdv2_c=DocValuesFormat(name=Lucene80), bdv1=DocValuesFormat(name=Direct), bdv1_c=DocValuesFormat(name=Asserting), intPoint1d=DocValuesFormat(name=Lucene80), doublePoint2d=DocValuesFormat(name=Asserting), dvBytesDerefVar=DocValuesFormat(name=Lucene80), id=DocValuesFormat(name=Asserting), binaryPoint2d=DocValuesFormat(name=Direct), dvSortedNumeric=DocValuesFormat(name=Lucene80), dvBytesDerefFixed=DocValuesFormat(name=Direct), autf8=DocValuesFormat(name=Lucene80), new_binary=DocValuesFormat(name=Lucene80), dvBytesSortedFixed=DocValuesFormat(name=Lucene80), dvBytesStraightVar=DocValuesFormat(name=Lucene80), dvBytesStraightFixed=DocValuesFormat(name=Asserting), dvLong=DocValuesFormat(name=Lucene80), longPoint1d=DocValuesFormat(name=Direct), floatPoint2d=DocValuesFormat(name=Lucene80), dvDouble=DocValuesFormat(name=Asserting), dvFloat=DocValuesFormat(name=Lucene80), content6=DocValuesFormat(name=Asserting), content5=DocValuesFormat(name=Lucene80), dvPacked=DocValuesFormat(name=Lucene80), intPoint2d=DocValuesFormat(name=Asserting), content4=DocValuesFormat(name=Direct), content3=DocValuesFormat(name=Lucene80), content2=DocValuesFormat(name=Asserting), doublePoint1d=DocValuesFormat(name=Lucene80), ndv1_c=DocValuesFormat(name=Asserting), dvByte=DocValuesFormat(name=Lucene80), ndv2_c=DocValuesFormat(name=Lucene80), binaryPoint1d=DocValuesFormat(name=Lucene80)}, maxPointsInLeafNode=1760, maxMBSortInHeap=7.991158439433579, sim=Asserting(org.apache.lucene.search.similarities.AssertingSimilarity@19dded99), locale=es-PR, timezone=Europe/Sarajevo
[junit4] 2> NOTE: Linux 4.4.0-170-generic amd64/Oracle Corporation 1.8.0_191 (64-bit)/cpus=8,threads=1,free=367221616,total=473956352
[junit4] 2> NOTE: All tests run in this JVM: [TestLucene70NormsFormat, TestForUtil, TestBackwardsCompatibility]
[junit4] Completed [8/10 (1!)] on J0 in 40.92s, 33 tests, 1 failure, 8 skipped <<< FAILURES!
[...truncated 63202 lines...]
[JENKINS] Lucene-Solr-Tests-8.5 - Build # 212 - Still Unstable
Posted by Apache Jenkins Server <je...@builds.apache.org>.
Build: https://builds.apache.org/job/Lucene-Solr-Tests-8.5/212/
1 tests failed.
FAILED: org.apache.lucene.index.TestBackwardsCompatibility.testAllVersionsTested
Error Message:
Extra backcompat test files: 7.7.3-cfs
Stack Trace:
java.lang.AssertionError: Extra backcompat test files:
7.7.3-cfs
at __randomizedtesting.SeedInfo.seed([8DF692CC80FD48A4:9D297D8C346A5E88]:0)
at org.junit.Assert.fail(Assert.java:88)
at org.apache.lucene.index.TestBackwardsCompatibility.testAllVersionsTested(TestBackwardsCompatibility.java:706)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.lang.Thread.run(Thread.java:748)
Build Log:
[...truncated 5472 lines...]
[junit4] Suite: org.apache.lucene.index.TestBackwardsCompatibility
[junit4] IGNOR/A 0.02s J1 | TestBackwardsCompatibility.testCreateSortedIndex
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] 2> NOTE: reproduce with: ant test -Dtestcase=TestBackwardsCompatibility -Dtests.method=testAllVersionsTested -Dtests.seed=8DF692CC80FD48A4 -Dtests.multiplier=2 -Dtests.slow=true -Dtests.locale=pl -Dtests.timezone=America/Argentina/Mendoza -Dtests.asserts=true -Dtests.file.encoding=UTF-8
[junit4] FAILURE 0.00s J1 | TestBackwardsCompatibility.testAllVersionsTested <<<
[junit4] > Throwable #1: java.lang.AssertionError: Extra backcompat test files:
[junit4] > 7.7.3-cfs
[junit4] > at __randomizedtesting.SeedInfo.seed([8DF692CC80FD48A4:9D297D8C346A5E88]:0)
[junit4] > at org.apache.lucene.index.TestBackwardsCompatibility.testAllVersionsTested(TestBackwardsCompatibility.java:706)
[junit4] > at java.lang.Thread.run(Thread.java:748)
[junit4] IGNOR/A 0.00s J1 | TestBackwardsCompatibility.testCreateSingleSegmentNoCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J1 | TestBackwardsCompatibility.testCreateCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J1 | TestBackwardsCompatibility.testCreateNoCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J1 | TestBackwardsCompatibility.testCreateSingleSegmentCFS
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J1 | TestBackwardsCompatibility.testCreateMoreTermsIndex
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J1 | TestBackwardsCompatibility.testCreateIndexWithDocValuesUpdates
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] IGNOR/A 0.00s J1 | TestBackwardsCompatibility.testCreateEmptyIndex
[junit4] > Assumption #1: backcompat creation tests must be run with -Dtests.bwcdir=/path/to/write/indexes
[junit4] 2> NOTE: leaving temporary files on disk at: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-8.5/lucene/build/backward-codecs/test/J1/temp/lucene.index.TestBackwardsCompatibility_8DF692CC80FD48A4-001
[junit4] 2> NOTE: test params are: codec=DummyCompressingStoredFieldsData(storedFieldsFormat=CompressingStoredFieldsFormat(compressionMode=DUMMY, chunkSize=5, maxDocsPerChunk=4, blockShift=8), termVectorsFormat=CompressingTermVectorsFormat(compressionMode=DUMMY, chunkSize=5, blockSize=8)), sim=Asserting(org.apache.lucene.search.similarities.AssertingSimilarity@5438ce1), locale=pl, timezone=America/Argentina/Mendoza
[junit4] 2> NOTE: Linux 4.15.0-54-generic amd64/Oracle Corporation 1.8.0_191 (64-bit)/cpus=4,threads=1,free=310265080,total=353894400
[junit4] 2> NOTE: All tests run in this JVM: [TestBackwardsCompatibility]
[junit4] Completed [8/10 (1!)] on J1 in 30.88s, 33 tests, 1 failure, 8 skipped <<< FAILURES!
[...truncated 63192 lines...]