Build: https://ci-builds.apache.org/job/Lucene/job/Lucene-Solr-NightlyTests-8.10/47/
2 tests failed. FAILED: org.apache.solr.handler.component.DistributedQueryComponentCustomSortTest.test Error Message: Error from server at https://127.0.0.1:36485/collection1: org.apache.solr.client.solrj.SolrServerException: Time allowed to handle this request exceeded:[https://[::1]:4, https://[::1]:8, https://[::1]:6] Stack Trace: org.apache.solr.client.solrj.impl.HttpSolrClient$RemoteSolrException: Error from server at https://127.0.0.1:36485/collection1: org.apache.solr.client.solrj.SolrServerException: Time allowed to handle this request exceeded:[https://[::1]:4, https://[::1]:8, https://[::1]:6] at __randomizedtesting.SeedInfo.seed([78343C42BCF7D328:F0600398120BBED0]:0) at org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:681) at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:266) at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:248) at org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:214) at org.apache.solr.client.solrj.SolrClient.query(SolrClient.java:1003) at org.apache.solr.client.solrj.SolrClient.query(SolrClient.java:1018) at org.apache.solr.BaseDistributedSearchTestCase.queryServer(BaseDistributedSearchTestCase.java:623) at org.apache.solr.handler.component.DistributedQueryComponentCustomSortTest.queryAllowPartialResults(DistributedQueryComponentCustomSortTest.java:139) at org.apache.solr.handler.component.DistributedQueryComponentCustomSortTest.test(DistributedQueryComponentCustomSortTest.java:129) 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.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1084) at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1055) at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57) at org.junit.rules.RunRules.evaluate(RunRules.java:20) 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 org.junit.rules.RunRules.evaluate(RunRules.java:20) 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.junit.rules.RunRules.evaluate(RunRules.java:20) 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 org.junit.rules.RunRules.evaluate(RunRules.java:20) at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36) at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368) at java.lang.Thread.run(Thread.java:748) FAILED: org.apache.solr.handler.component.TestDistributedStatsComponentCardinality.test Error Message: Captured an uncaught exception in thread: Thread[id=127109, name=Thread-72709, state=RUNNABLE, group=TGRP-TestDistributedStatsComponentCardinality] Stack Trace: com.carrotsearch.randomizedtesting.UncaughtExceptionError: Captured an uncaught exception in thread: Thread[id=127109, name=Thread-72709, state=RUNNABLE, group=TGRP-TestDistributedStatsComponentCardinality] at __randomizedtesting.SeedInfo.seed([78343C42BCF7D328:F0600398120BBED0]:0) Caused by: junit.framework.AssertionFailedError: .responseHeader.status:200!=0 at __randomizedtesting.SeedInfo.seed([78343C42BCF7D328]:0) at junit.framework.Assert.fail(Assert.java:57) at org.apache.solr.BaseDistributedSearchTestCase.compareSolrResponses(BaseDistributedSearchTestCase.java:1000) at org.apache.solr.BaseDistributedSearchTestCase.compareResponses(BaseDistributedSearchTestCase.java:1027) at org.apache.solr.BaseDistributedSearchTestCase$5.run(BaseDistributedSearchTestCase.java:688) Build Log: [...truncated 15490 lines...] [junit4] Suite: org.apache.solr.handler.component.DistributedQueryComponentCustomSortTest [junit4] 2> 3884588 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.SolrTestCase Setting 'solr.default.confdir' system property to test-framework derived value of '/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/server/solr/configsets/_default/conf' [junit4] 2> 3884588 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom [junit4] 2> 3884588 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.SolrTestCaseJ4 Created dataDir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/data-dir-252-001 [junit4] 2> 3884588 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=1 numCloses=1 [junit4] 2> 3884589 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.SolrTestCaseJ4 Using TrieFields (NUMERIC_POINTS_SYSPROP=false) w/NUMERIC_DOCVALUES_SYSPROP=true [junit4] 2> 3884590 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.SolrTestCaseJ4 Randomized ssl (true) and clientAuth (true) via: @org.apache.solr.util.RandomizeSSL(reason=, value=NaN, ssl=NaN, clientAuth=NaN) [junit4] 2> 3884591 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.BaseDistributedSearchTestCase Setting hostContext system property: / [junit4] 2> 3884591 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.SolrTestCaseJ4 ####initCore [junit4] 2> 3884597 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.c.SolrResourceLoader Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib/classes] [junit4] 2> 3884614 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.10.2 [junit4] 2> 3884614 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.c.SolrConfig solrconfig.xml: <boolTofilterOptimizer> is currently not implemented and has no effect. [junit4] 2> 3884614 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead [junit4] 2> 3884616 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.s.IndexSchema Schema name=test-custom-field-sort [junit4] 2> 3884616 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.s.IndexSchema Loaded schema test-custom-field-sort/1.6 with uniqueid field id [junit4] 2> 3885835 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.c.CoreContainer Unable to create [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/userfiles]. Features requiring this directory may fail. [junit4] 2> => java.security.AccessControlException: access denied ("java.io.FilePermission" "/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/userfiles" "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/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/userfiles" "write") [junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472) ~[?:1.8.0_291] [junit4] 2> at java.security.AccessController.checkPermission(AccessController.java:886) ~[?:1.8.0_291] [junit4] 2> at java.lang.SecurityManager.checkPermission(SecurityManager.java:549) ~[?:1.8.0_291] [junit4] 2> at java.lang.SecurityManager.checkWrite(SecurityManager.java:979) ~[?:1.8.0_291] [junit4] 2> at sun.nio.fs.UnixPath.checkWrite(UnixPath.java:801) ~[?:?] [junit4] 2> at sun.nio.fs.UnixFileSystemProvider.createDirectory(UnixFileSystemProvider.java:376) ~[?:?] [junit4] 2> at java.nio.file.Files.createDirectory(Files.java:674) ~[?:1.8.0_291] [junit4] 2> at java.nio.file.Files.createAndCheckIsDirectory(Files.java:781) ~[?:1.8.0_291] [junit4] 2> at java.nio.file.Files.createDirectories(Files.java:727) ~[?:1.8.0_291] [junit4] 2> at org.apache.solr.core.CoreContainer.<init>(CoreContainer.java:378) [java/:?] [junit4] 2> at org.apache.solr.core.CoreContainer.<init>(CoreContainer.java:343) [java/:?] [junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:183) [java/:?] [junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:156) [java/:?] [junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:162) [java/:?] [junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:112) [java/:?] [junit4] 2> at org.apache.solr.SolrTestCaseJ4.createCore(SolrTestCaseJ4.java:813) [java/:?] [junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:803) [java/:?] [junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:664) [java/:?] [junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:653) [java/:?] [junit4] 2> at org.apache.solr.handler.component.DistributedQueryComponentCustomSortTest.setUpBeforeClass(DistributedQueryComponentCustomSortTest.java:44) [test/:?] [junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) ~[?:1.8.0_291] [junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62) ~[?:1.8.0_291] [junit4] 2> at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:1.8.0_291] [junit4] 2> at java.lang.reflect.Method.invoke(Method.java:498) ~[?:1.8.0_291] [junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750) [randomizedtesting-runner-2.7.2.jar:?] [junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:878) [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.junit.rules.RunRules.evaluate(RunRules.java:20) [junit-4.13.1.jar:4.13.1] [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 org.junit.rules.RunRules.evaluate(RunRules.java:20) [junit-4.13.1.jar:4.13.1] [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_291] [junit4] 2> 3885837 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.f.DistribPackageStore Unable to create [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/filestore] directory in SOLR_HOME [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/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/Lucene-Solr-NightlyTests-8.10/checkout/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/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/filestore" "write") [junit4] 2> at java.security.AccessControlContext.checkPermission(AccessControlContext.java:472) ~[?:1.8.0_291] [junit4] 2> at java.security.AccessController.checkPermission(AccessController.java:886) ~[?:1.8.0_291] [junit4] 2> at java.lang.SecurityManager.checkPermission(SecurityManager.java:549) ~[?:1.8.0_291] [junit4] 2> at java.lang.SecurityManager.checkWrite(SecurityManager.java:979) ~[?:1.8.0_291] [junit4] 2> at java.io.File.mkdir(File.java:1348) ~[?:1.8.0_291] [junit4] 2> at java.io.File.mkdirs(File.java:1380) ~[?:1.8.0_291] [junit4] 2> at org.apache.solr.filestore.DistribPackageStore.ensurePackageStoreDir(DistribPackageStore.java:561) [java/:?] [junit4] 2> at org.apache.solr.filestore.DistribPackageStore.<init>(DistribPackageStore.java:81) [java/:?] [junit4] 2> at org.apache.solr.filestore.PackageStoreAPI.<init>(PackageStoreAPI.java:78) [java/:?] [junit4] 2> at org.apache.solr.core.CoreContainer.load(CoreContainer.java:679) [java/:?] [junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:184) [java/:?] [junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:156) [java/:?] [junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:162) [java/:?] [junit4] 2> at org.apache.solr.util.TestHarness.<init>(TestHarness.java:112) [java/:?] [junit4] 2> at org.apache.solr.SolrTestCaseJ4.createCore(SolrTestCaseJ4.java:813) [java/:?] [junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:803) [java/:?] [junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:664) [java/:?] [junit4] 2> at org.apache.solr.SolrTestCaseJ4.initCore(SolrTestCaseJ4.java:653) [java/:?] [junit4] 2> at org.apache.solr.handler.component.DistributedQueryComponentCustomSortTest.setUpBeforeClass(DistributedQueryComponentCustomSortTest.java:44) [test/:?] [junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) ~[?:1.8.0_291] [junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62) ~[?:1.8.0_291] [junit4] 2> at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) ~[?:1.8.0_291] [junit4] 2> at java.lang.reflect.Method.invoke(Method.java:498) ~[?:1.8.0_291] [junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750) [randomizedtesting-runner-2.7.2.jar:?] [junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:878) [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.junit.rules.RunRules.evaluate(RunRules.java:20) [junit-4.13.1.jar:4.13.1] [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 org.junit.rules.RunRules.evaluate(RunRules.java:20) [junit-4.13.1.jar:4.13.1] [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_291] [junit4] 2> 3885838 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false] [junit4] 2> 3885838 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] 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> 3885839 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@2765f1b9[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3885839 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@2765f1b9[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3885842 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] 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> 3885842 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@93c5573[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3885842 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@93c5573[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3885844 WARN (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] 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> 3885893 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3885901 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3885901 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3885902 INFO (coreLoadExecutor-29940-thread-1) [ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient core cache for max 2147483647 cores with initial capacity of 1024 [junit4] 2> 3885910 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.c.SolrResourceLoader Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib/classes] [junit4] 2> 3885929 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.10.2 [junit4] 2> 3885929 WARN (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <boolTofilterOptimizer> is currently not implemented and has no effect. [junit4] 2> 3885929 WARN (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead [junit4] 2> 3885930 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Schema name=test-custom-field-sort [junit4] 2> 3885931 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Loaded schema test-custom-field-sort/1.6 with uniqueid field id [junit4] 2> 3885931 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from instancedir /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1, trusted=true [junit4] 2> 3885931 INFO (coreLoadExecutor-29940-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@4860833b [junit4] 2> 3885931 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/data-dir-252-001/] [junit4] 2> 3885933 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=11, maxMergeAtOnceExplicit=21, maxMergedSegmentMB=36.6181640625, floorSegmentMB=0.9443359375, forceMergeDeletesPctAllowed=2.9144329147625303, segmentsPerTier=17.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3050975115890079, deletesPctAllowed=37.70617608239115 [junit4] 2> 3885994 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog [junit4] 2> 3885994 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536 [junit4] 2> 3885995 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 3885995 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 3885996 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=36, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0] [junit4] 2> 3885997 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Initializing spell checkers [junit4] 2> 3886012 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.s.DirectSolrSpellChecker init: {name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3} [junit4] 2> 3886081 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms [junit4] 2> 3886081 INFO (coreLoadExecutor-29940-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1714539128214781952 [junit4] 2> 3886082 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default [junit4] 2> 3886083 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct [junit4] 2> 3886083 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak [junit4] 2> 3886083 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: multipleFields [junit4] 2> 3886083 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler [junit4] 2> 3886083 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external [junit4] 2> 3886083 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq [junit4] 2> 3886083 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn [junit4] 2> 3886084 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict [junit4] 2> 3886084 INFO (SUITE-DistributedQueryComponentCustomSortTest-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.SolrTestCaseJ4 ####initCore end [junit4] 2> 3886085 INFO (searcherExecutor-29942-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] Registered new searcher autowarm time: 0 ms [junit4] 2> 3886221 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.SolrTestCaseJ4 Writing core.properties file to /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/control/cores/collection1 [junit4] 2> 3886223 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0) [junit4] 2> 3886223 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ... [junit4] 2> 3886223 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.Server jetty-9.4.44.v20210927; built: 2021-09-27T23:02:44.612Z; git: 8da83308eeca865e495e53ef315a249d63ba9332; jvm 1.8.0_291-b10 [junit4] 2> 3886223 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 3886223 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 3886223 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session node0 Scavenging every 660000ms [junit4] 2> 3886224 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@3863082f{/,null,AVAILABLE} [junit4] 2> 3886224 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@135e2956{SSL, (ssl, http/1.1)}{127.0.0.1:33281} [junit4] 2> 3886224 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.Server Started @3886259ms [junit4] 2> 3886224 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {schema=schema-custom-field.xml, solrconfig=solrconfig.xml, hostContext=/, hostPort=33281, coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/control/cores} [junit4] 2> 3886225 ERROR (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 3886225 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 3886225 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version 8.10.2 [junit4] 2> 3886225 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in standalone mode on port null [junit4] 2> 3886225 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr [junit4] 2> 3886225 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2021-10-24T21:45:31.196Z [junit4] 2> 3886225 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/control/solr.xml [junit4] 2> 3886227 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay is ignored [junit4] 2> 3886227 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverBadNodeExpiration is ignored [junit4] 2> 3886229 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b, but no JMX reporters were configured - adding default JMX reporter. [junit4] 2> 3887358 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false] [junit4] 2> 3887359 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3887359 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@6b901091[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3887359 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@6b901091[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3887365 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3887368 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@1e9df72[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3887368 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@1e9df72[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3887369 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3887381 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient core cache for max 4 cores with initial capacity of 4 [junit4] 2> 3887382 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory. [junit4] 2> 3887408 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3887440 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3887440 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3887442 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/control/cores [junit4] 2> 3887442 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.CorePropertiesLocator Cores are: [collection1] [junit4] 2> 3887450 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.c.SolrResourceLoader Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib/classes] [junit4] 2> 3887483 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.10.2 [junit4] 2> 3887483 WARN (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <boolTofilterOptimizer> is currently not implemented and has no effect. [junit4] 2> 3887483 WARN (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead [junit4] 2> 3887485 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Schema name=test-custom-field-sort [junit4] 2> 3887485 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Loaded schema test-custom-field-sort/1.6 with uniqueid field id [junit4] 2> 3887485 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from configset /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1, trusted=true [junit4] 2> 3887486 INFO (coreLoadExecutor-29960-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@4860833b [junit4] 2> 3887486 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/control/cores/collection1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/control/cores/collection1/data/] [junit4] 2> 3887488 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=11, maxMergeAtOnceExplicit=21, maxMergedSegmentMB=36.6181640625, floorSegmentMB=0.9443359375, forceMergeDeletesPctAllowed=2.9144329147625303, segmentsPerTier=17.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3050975115890079, deletesPctAllowed=37.70617608239115 [junit4] 2> 3887562 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog [junit4] 2> 3887562 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536 [junit4] 2> 3887563 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 3887563 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 3887564 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=36, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0] [junit4] 2> 3887565 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Initializing spell checkers [junit4] 2> 3887587 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.s.DirectSolrSpellChecker init: {name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3} [junit4] 2> 3887655 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms [junit4] 2> 3887656 INFO (coreLoadExecutor-29960-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1714539129866289152 [junit4] 2> 3887657 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default [junit4] 2> 3887657 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct [junit4] 2> 3887657 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak [junit4] 2> 3887657 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: multipleFields [junit4] 2> 3887657 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler [junit4] 2> 3887658 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external [junit4] 2> 3887658 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq [junit4] 2> 3887658 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn [junit4] 2> 3887658 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict [junit4] 2> 3887660 INFO (searcherExecutor-29962-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] Registered new searcher autowarm time: 0 ms [junit4] 2> 3888279 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.SolrTestCaseJ4 Writing core.properties file to /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard0/cores/collection1 [junit4] 2> 3888280 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0) [junit4] 2> 3888280 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ... [junit4] 2> 3888280 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.Server jetty-9.4.44.v20210927; built: 2021-09-27T23:02:44.612Z; git: 8da83308eeca865e495e53ef315a249d63ba9332; jvm 1.8.0_291-b10 [junit4] 2> 3888287 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 3888287 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 3888287 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session node0 Scavenging every 660000ms [junit4] 2> 3888287 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@342a714e{/,null,AVAILABLE} [junit4] 2> 3888288 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@5e880ab4{SSL, (ssl, http/1.1)}{127.0.0.1:36485} [junit4] 2> 3888288 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.Server Started @3888323ms [junit4] 2> 3888288 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {schema=schema-custom-field.xml, solrconfig=solrconfig.xml, hostContext=/, hostPort=36485, coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard0/cores} [junit4] 2> 3888288 ERROR (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 3888288 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 3888288 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version 8.10.2 [junit4] 2> 3888288 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in standalone mode on port null [junit4] 2> 3888288 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr [junit4] 2> 3888288 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2021-10-24T21:45:33.259Z [junit4] 2> 3888288 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard0/solr.xml [junit4] 2> 3888291 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay is ignored [junit4] 2> 3888291 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverBadNodeExpiration is ignored [junit4] 2> 3888292 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b, but no JMX reporters were configured - adding default JMX reporter. [junit4] 2> 3888578 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false] [junit4] 2> 3888578 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3888579 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@7d9047b9[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3888579 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@7d9047b9[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3888582 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3888582 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@29504b3a[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3888582 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@29504b3a[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3888584 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3888596 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient core cache for max 4 cores with initial capacity of 4 [junit4] 2> 3888597 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory. [junit4] 2> 3888620 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3888633 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3888633 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3888634 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard0/cores [junit4] 2> 3888635 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.CorePropertiesLocator Cores are: [collection1] [junit4] 2> 3888644 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.c.SolrResourceLoader Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib/classes] [junit4] 2> 3888698 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.10.2 [junit4] 2> 3888698 WARN (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <boolTofilterOptimizer> is currently not implemented and has no effect. [junit4] 2> 3888698 WARN (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead [junit4] 2> 3888701 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Schema name=test-custom-field-sort [junit4] 2> 3888702 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Loaded schema test-custom-field-sort/1.6 with uniqueid field id [junit4] 2> 3888702 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from configset /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1, trusted=true [junit4] 2> 3888703 INFO (coreLoadExecutor-29979-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@4860833b [junit4] 2> 3888703 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard0/cores/collection1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard0/cores/collection1/data/] [junit4] 2> 3888706 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=11, maxMergeAtOnceExplicit=21, maxMergedSegmentMB=36.6181640625, floorSegmentMB=0.9443359375, forceMergeDeletesPctAllowed=2.9144329147625303, segmentsPerTier=17.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3050975115890079, deletesPctAllowed=37.70617608239115 [junit4] 2> 3888788 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog [junit4] 2> 3888789 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536 [junit4] 2> 3888790 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 3888790 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 3888790 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=36, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0] [junit4] 2> 3888791 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Initializing spell checkers [junit4] 2> 3888807 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.s.DirectSolrSpellChecker init: {name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3} [junit4] 2> 3888871 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms [junit4] 2> 3888871 INFO (coreLoadExecutor-29979-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1714539131140308992 [junit4] 2> 3888873 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default [junit4] 2> 3888874 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct [junit4] 2> 3888874 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak [junit4] 2> 3888874 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: multipleFields [junit4] 2> 3888875 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler [junit4] 2> 3888875 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external [junit4] 2> 3888875 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq [junit4] 2> 3888876 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn [junit4] 2> 3888876 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict [junit4] 2> 3888878 INFO (searcherExecutor-29981-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] Registered new searcher autowarm time: 0 ms [junit4] 2> 3889060 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.SolrTestCaseJ4 Writing core.properties file to /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard1/cores/collection1 [junit4] 2> 3889061 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0) [junit4] 2> 3889061 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ... [junit4] 2> 3889061 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.Server jetty-9.4.44.v20210927; built: 2021-09-27T23:02:44.612Z; git: 8da83308eeca865e495e53ef315a249d63ba9332; jvm 1.8.0_291-b10 [junit4] 2> 3889068 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 3889068 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 3889068 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session node0 Scavenging every 600000ms [junit4] 2> 3889076 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@49d02c85{/,null,AVAILABLE} [junit4] 2> 3889076 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@34944e3c{SSL, (ssl, http/1.1)}{127.0.0.1:36143} [junit4] 2> 3889076 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.Server Started @3889111ms [junit4] 2> 3889076 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {schema=schema-custom-field.xml, solrconfig=solrconfig.xml, hostContext=/, hostPort=36143, coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard1/cores} [junit4] 2> 3889077 ERROR (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 3889077 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 3889077 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version 8.10.2 [junit4] 2> 3889077 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in standalone mode on port null [junit4] 2> 3889077 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr [junit4] 2> 3889077 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2021-10-24T21:45:34.048Z [junit4] 2> 3889077 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard1/solr.xml [junit4] 2> 3889079 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay is ignored [junit4] 2> 3889079 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverBadNodeExpiration is ignored [junit4] 2> 3889081 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b, but no JMX reporters were configured - adding default JMX reporter. [junit4] 2> 3889526 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false] [junit4] 2> 3889526 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3889532 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@2d187862[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3889532 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@2d187862[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3889535 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3889539 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@3ad7e5f2[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3889539 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@3ad7e5f2[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3889541 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3889563 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient core cache for max 4 cores with initial capacity of 4 [junit4] 2> 3889563 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory. [junit4] 2> 3889588 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3889601 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3889602 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3889603 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard1/cores [junit4] 2> 3889603 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.CorePropertiesLocator Cores are: [collection1] [junit4] 2> 3889613 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.c.SolrResourceLoader Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib/classes] [junit4] 2> 3889664 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.10.2 [junit4] 2> 3889664 WARN (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <boolTofilterOptimizer> is currently not implemented and has no effect. [junit4] 2> 3889664 WARN (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead [junit4] 2> 3889667 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Schema name=test-custom-field-sort [junit4] 2> 3889667 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.s.IndexSchema Loaded schema test-custom-field-sort/1.6 with uniqueid field id [junit4] 2> 3889667 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using configuration from configset /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1, trusted=true [junit4] 2> 3889668 INFO (coreLoadExecutor-29998-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@4860833b [junit4] 2> 3889668 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard1/cores/collection1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard1/cores/collection1/data/] [junit4] 2> 3889671 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: maxMergeAtOnce=11, maxMergeAtOnceExplicit=21, maxMergedSegmentMB=36.6181640625, floorSegmentMB=0.9443359375, forceMergeDeletesPctAllowed=2.9144329147625303, segmentsPerTier=17.0, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3050975115890079, deletesPctAllowed=37.70617608239115 [junit4] 2> 3889741 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog [junit4] 2> 3889741 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536 [junit4] 2> 3889742 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled [junit4] 2> 3889742 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled [junit4] 2> 3889743 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: minMergeSize=1677721, mergeFactor=36, maxMergeSize=2147483648, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0] [junit4] 2> 3889744 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Initializing spell checkers [junit4] 2> 3889759 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.s.DirectSolrSpellChecker init: {name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3} [junit4] 2> 3889831 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms [junit4] 2> 3889831 INFO (coreLoadExecutor-29998-thread-1) [ x:collection1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1714539132146941952 [junit4] 2> 3889832 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default [junit4] 2> 3889833 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: direct [junit4] 2> 3889833 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: wordbreak [junit4] 2> 3889833 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: multipleFields [junit4] 2> 3889833 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: jarowinkler [junit4] 2> 3889833 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: external [junit4] 2> 3889833 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: freq [junit4] 2> 3889834 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: fqcn [junit4] 2> 3889834 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: perDict [junit4] 2> 3889836 INFO (searcherExecutor-30000-thread-1-processing-x:collection1) [ x:collection1 ] o.a.s.c.SolrCore [collection1] Registered new searcher autowarm time: 0 ms [junit4] 2> 3889959 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.SolrTestCaseJ4 Writing core.properties file to /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard2/cores/collection1 [junit4] 2> 3889960 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0) [junit4] 2> 3889960 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ... [junit4] 2> 3889960 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.Server jetty-9.4.44.v20210927; built: 2021-09-27T23:02:44.612Z; git: 8da83308eeca865e495e53ef315a249d63ba9332; jvm 1.8.0_291-b10 [junit4] 2> 3889961 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 3889961 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 3889961 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.session node0 Scavenging every 660000ms [junit4] 2> 3889962 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@3a53121c{/,null,AVAILABLE} [junit4] 2> 3889962 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@518f341{SSL, (ssl, http/1.1)}{127.0.0.1:33069} [junit4] 2> 3889962 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.s.Server Started @3889997ms [junit4] 2> 3889963 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {schema=schema-custom-field.xml, solrconfig=solrconfig.xml, hostContext=/, hostPort=33069, coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard2/cores} [junit4] 2> 3889963 ERROR (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 3889963 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 3889963 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version 8.10.2 [junit4] 2> 3889963 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in standalone mode on port null [junit4] 2> 3889963 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr [junit4] 2> 3889963 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2021-10-24T21:45:34.934Z [junit4] 2> 3889963 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard2/solr.xml [junit4] 2> 3889966 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay is ignored [junit4] 2> 3889966 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverBadNodeExpiration is ignored [junit4] 2> 3889967 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b, but no JMX reporters were configured - adding default JMX reporter. [junit4] 2> 3890674 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false] [junit4] 2> 3890675 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3890675 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@7425d71b[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3890675 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@7425d71b[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3890679 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3890680 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@740e9425[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3890680 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@740e9425[provider=null,keyStore=null,trustStore=null] [junit4] 2> 3890682 WARN (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] 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> 3890694 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient core cache for max 4 cores with initial capacity of 4 [junit4] 2> 3890694 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory. [junit4] 2> 3890717 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3890745 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3890745 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4860833b [junit4] 2> 3890747 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/build/solr-core/test/J0/temp/solr.handler.component.DistributedQueryComponentCustomSortTest_78343C42BCF7D328-001/tempDir-001/shard2/cores [junit4] 2> 3890747 INFO (TEST-DistributedQueryComponentCustomSortTest.test-seed#[78343C42BCF7D328]) [ ] o.a.s.c.CorePropertiesLocator Cores are: [collection1] [junit4] 2> 3890756 INFO (coreLoadExecutor-30017-thread-1) [ x:collection1 ] o.a.s.c.SolrResourceLoader Added 2 libs to classloader, from paths: [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib, /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/checkout/solr/core/src/test-files/solr/collection1/lib/classes] [junit4] 2> 3890777 INFO (coreLoadExecutor-30017-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.10.2 [junit4] 2> 3890777 WARN (coreLoadExecutor-30017-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <boolTofilterOptimizer> is currently not implemented and has no effect. [junit4] 2> 3890777 WARN (coreLoadExecutor-30017-thread-1) [ x:collection1 ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section [...truncated too long message...] extHandler Stopped o.e.j.s.ServletContextHandler@27f9ac9a{/,null,STOPPED} [junit4] 2> 4085580 INFO (closeThreadPool-37401-thread-2) [ ] o.e.j.s.session node0 Stopped scavenging [junit4] 2> 4085581 INFO (coreCloseExecutor-37425-thread-1) [ ] o.a.s.u.DirectUpdateHandler2 Committing on IndexWriter.close() ... SKIPPED (unnecessary). [junit4] 2> 4085584 INFO (closeThreadPool-37401-thread-6) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node tag=null [junit4] 2> 4085584 INFO (closeThreadPool-37401-thread-6) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@43db713b: rootName = null, domain = solr.node, service url = null, agent id = null] for registry solr.node/com.codahale.metrics.MetricRegistry@589e38b8 [junit4] 2> 4085589 INFO (closeThreadPool-37401-thread-6) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm tag=null [junit4] 2> 4085589 INFO (closeThreadPool-37401-thread-6) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@733ac29c: rootName = null, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm/com.codahale.metrics.MetricRegistry@4516c530 [junit4] 2> 4085591 INFO (closeThreadPool-37401-thread-6) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty tag=null [junit4] 2> 4085591 INFO (closeThreadPool-37401-thread-6) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@19c2b2c4: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty/com.codahale.metrics.MetricRegistry@53e89520 [junit4] 2> 4085595 INFO (closeThreadPool-37401-thread-6) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@31e9a7fd{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:0} [junit4] 2> 4085595 INFO (closeThreadPool-37401-thread-6) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@17096976{/,null,STOPPED} [junit4] 2> 4085595 INFO (closeThreadPool-37401-thread-6) [ ] o.e.j.s.session node0 Stopped scavenging [junit4] 2> NOTE: download the large Jenkins line-docs file by running 'ant get-jenkins-line-docs' in the lucene directory. [junit4] 2> NOTE: reproduce with: ant test -Dtestcase=TestDistributedStatsComponentCardinality -Dtests.method=test -Dtests.seed=78343C42BCF7D328 -Dtests.multiplier=2 -Dtests.nightly=true -Dtests.slow=true -Dtests.linedocsfile=/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-NightlyTests-8.10/test-data/enwiki.random.lines.txt -Dtests.locale=el -Dtests.timezone=America/Indiana/Knox -Dtests.asserts=true -Dtests.file.encoding=UTF-8 [junit4] ERROR 189s J1 | TestDistributedStatsComponentCardinality.test <<< [junit4] > Throwable #1: com.carrotsearch.randomizedtesting.UncaughtExceptionError: Captured an uncaught exception in thread: Thread[id=127109, name=Thread-72709, state=RUNNABLE, group=TGRP-TestDistributedStatsComponentCardinality] [junit4] > at __randomizedtesting.SeedInfo.seed([78343C42BCF7D328:F0600398120BBED0]:0) [junit4] > Caused by: junit.framework.AssertionFailedError: .responseHeader.status:200!=0 [junit4] > at __randomizedtesting.SeedInfo.seed([78343C42BCF7D328]:0) [junit4] > at junit.framework.Assert.fail(Assert.java:57) [junit4] > at org.apache.solr.BaseDistributedSearchTestCase.compareSolrResponses(BaseDistributedSearchTestCase.java:1000) [junit4] > at org.apache.solr.BaseDistributedSearchTestCase.compareResponses(BaseDistributedSearchTestCase.java:1027) [junit4] > at org.apache.solr.BaseDistributedSearchTestCase$5.run(BaseDistributedSearchTestCase.java:688) [junit4] 2> 4085598 INFO (SUITE-TestDistributedStatsComponentCardinality-seed#[78343C42BCF7D328]-worker) [ ] o.a.s.SolrTestCaseJ4 ------------------------------------------------------- Done waiting for tracked resources to be released [junit4] 2> NOTE: test params are: codec=Asserting(Lucene87): {multiDefault=Lucene84, _root_=PostingsFormat(name=Asserting), string_s=PostingsFormat(name=LuceneVarGapFixedInterval), id=PostingsFormat(name=MockRandom)}, docValues:{int_i=DocValuesFormat(name=Lucene80), range_facet_l_dv=DocValuesFormat(name=Direct), intDefault=DocValuesFormat(name=Lucene80), int_i_prehashed_l=DocValuesFormat(name=Direct), range_facet_l=DocValuesFormat(name=Asserting), long_l_prehashed_l=DocValuesFormat(name=Direct), long_l=DocValuesFormat(name=Lucene80), _version_=DocValuesFormat(name=Lucene80), string_s_prehashed_l=DocValuesFormat(name=Direct), id_i1=DocValuesFormat(name=Lucene80), range_facet_i_dv=DocValuesFormat(name=Asserting), intDvoDefault=DocValuesFormat(name=Direct), timestamp=DocValuesFormat(name=Asserting)}, maxPointsInLeafNode=1961, maxMBSortInHeap=7.219918363284506, sim=Asserting(RandomSimilarity(queryNorm=true): {}), locale=el, timezone=America/Indiana/Knox [junit4] 2> NOTE: Linux 4.15.0-147-generic amd64/Oracle Corporation 1.8.0_291 (64-bit)/cpus=4,threads=1,free=118096160,total=529530880 [junit4] 2> NOTE: All tests run in this JVM: [TestSystemCollAutoCreate, SearchHandlerTest, MaxScoreCollectorTest, BadCopyFieldTest, PreAnalyzedFieldManagedSchemaCloudTest, TimeZoneUtilsTest, SolrCLIZkUtilsTest, TestSchemaResource, SplitByPrefixTest, TestSolrQueryParser, MetricsHistoryHandlerTest, TestClusterProperties, LeaderElectionIntegrationTest, TestJoin, CoreSorterTest, TestPayloadCheckQParserPlugin, TestSolrDeletionPolicy2, AutoAddReplicasPlanActionTest, TestUniqueKeyFieldResource, TestRandomRequestDistribution, ClusterStateTest, TestSolrConfigHandlerCloud, TestNumericRangeQuery32, TestCustomDocTransformer, ShowFileRequestHandlerTest, TestFreeTextSuggestions, TestConfigSetProperties, MoreLikeThisComponentTest, TestLRUCache, DirectSolrConnectionTest, TestLegacyFieldReuse, SolrMetricManagerTest, ConnectionReuseTest, TestLocalFSCloudBackupRestore, TestCloudDeleteByQuery, SpatialRPTFieldTypeTest, ReplicationFactorTest, BinaryUpdateRequestHandlerTest, OverseerSolrResponseUnsafeSerializationTest, DynamicMapsTest, RulesTest, ZkStateReaderTest, TermVectorComponentDistributedTest, LocalFSCloudIncrementalBackupTest, TestExplainDocTransformer, DistanceFunctionTest, TestSolrCachePerf, CheckHdfsIndexTest, NotRequiredUniqueKeyTest, HdfsWriteToMultipleCollectionsTest, SearchRateTriggerIntegrationTest, RandomizedTaggerTest, TestManagedResource, TestSimClusterStateProvider, CoreAdminHandlerTest, DistributedIntervalFacetingTest, TestReversedWildcardFilterFactory, TestExactStatsCache, TestReload, TestOmitPositions, SolrShardReporterTest, TestRetrieveFieldsOptimizer, DistribDocExpirationUpdateProcessorTest, CopyFieldTest, AssignTest, TestAtomicUpdateErrorCases, ShardRoutingTest, DistributedExpandComponentTest, TestRuleBasedAuthorizationWithKerberos, TestContainerPlugin, LeaderTragicEventTest, TestWithCollection, RequestHandlersTest, TestJsonRequest, CollectionTooManyReplicasTest, HdfsBasicDistributedZk2Test, TestShardHandlerFactory, JWTAuthPluginTest, TestIBSimilarityFactory, ZkFailoverTest, MaxSizeAutoCommitTest, DistributedSuggestComponentTest, TestSimTriggerIntegration, SolrCmdDistributorTest, TestEmbeddedSolrServerAdminHandler, SampleTest, TestUninvertingReader, SystemInfoHandlerTest, TestPKIAuthenticationPlugin, TestConfLoadPerf, HighlighterTest, TestConfigSetsAPIZkFailure, TestReRankQParserPlugin, TestHashQParserPlugin, TestFaceting, TestBlockCollapse, TestCorePropertiesReload, SecurityHeadersTest, TestSegmentSorting, HdfsDirectoryFactoryTest, HttpPartitionOnCommitTest, TestDynamicURP, BigEndianAscendingWordSerializerTest, ResponseBuilderTest, AtomicUpdatesTest, JvmMetricsTest, DistributedFacetPivotSmallAdvancedTest, TestJsonFacetsWithNestedObjects, RegexBytesRefFilterTest, SpellCheckComponentTest, SpatialHeatmapFacetsTest, TestCloudDeduplication, CollectionsAPISolrJTest, CustomHighlightComponentTest, XmlInterpolationTest, TestFunctionQuery, JsonLoaderTest, AnalysisAfterCoreReloadTest, BasicFunctionalityTest, ConvertedLegacyTest, CursorPagingTest, SolrTestCaseJ4Test, TestCrossCoreJoin, TestCursorMarkWithoutUniqueKey, TestDistributedGrouping, TestDistributedMissingSort, TestDistributedSearch, TestDocumentBuilder, TestGroupingSearch, TestSimpleTrackingShardHandler, TestSolrCoreProperties, TestTolerantSearch, TestTrie, PathHierarchyTokenizerFactoryTest, ProtectedTermFilterFactoryTest, TestCharFilters, TestDeprecatedFilters, AliasIntegrationTest, AssignBackwardCompatibilityTest, BasicDistributedZk2Test, BasicDistributedZkTest, BasicZkTest, ChaosMonkeyNothingIsSafeTest, ChaosMonkeySafeLeaderTest, CloudExitableDirectoryReaderTest, DeleteInactiveReplicaTest, DeleteReplicaTest, ForceLeaderWithTlogReplicasTest, MetricsHistoryWithAuthIntegrationTest, MigrateRouteKeyTest, MissingSegmentRecoveryTest, MoveReplicaHDFSFailoverTest, MultiSolrCloudTestCaseTest, MultiThreadedOCPTest, PeerSyncReplicationTest, ReplaceNodeNoTargetTest, RoutingToNodesWithPropertiesTest, SyncSliceTest, TestCloudRecovery, TestDistributedMap, TestDownShardTolerantSearch, TestExclusionRuleCollectionAccess, TestHashPartitioner, TestLockTree, TestMiniSolrCloudClusterSSL, TestPullReplicaErrorHandling, TestStressInPlaceUpdates, TestTlogReplayVsRecovery, TestTlogReplica, VMParamsZkACLAndCredentialsProvidersTest, ConcurrentCreateCollectionTest, ConcurrentDeleteAndCreateCollectionTest, HdfsAutoAddReplicasIntegrationTest, IndexSizeTriggerTest, RestoreTriggerStateTest, TriggerCooldownIntegrationTest, TestSimLargeCluster, CdcrReplicationHandlerTest, CdcrVersionReplicationTest, CdcrWithNodesRestartsTest, TestConfigsApi, ThreadDumpHandlerTest, ZookeeperStatusHandlerFailureTest, DistributedMLTComponentTest, DistributedQueryComponentOptimizationTest, TestDistributedStatsComponentCardinality] [junit4] Completed [702/948 (2!)] on J1 in 189.24s, 1 test, 1 error <<< FAILURES! [...truncated 55064 lines...]
--------------------------------------------------------------------- To unsubscribe, e-mail: [email protected] For additional commands, e-mail: [email protected]
