You are viewing a plain text version of this content. The canonical link for it is here.
Posted to builds@solr.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2021/03/15 20:58:13 UTC
[JENKINS] Solr » Solr-Check-main - Build # 61 - Still Unstable!
Build: https://ci-builds.apache.org/job/Solr/job/Solr-Check-main/61/
1 tests failed.
FAILED: org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort
Error Message:
java.lang.IllegalStateException: unexpected docvalues type SORTED for field 'stringdv' (expected=BINARY). Re-index with correct docvalues type.
Stack Trace:
java.lang.IllegalStateException: unexpected docvalues type SORTED for field 'stringdv' (expected=BINARY). Re-index with correct docvalues type.
at __randomizedtesting.SeedInfo.seed([A42271084D7F56EB:297C3CD01A938B9C]:0)
at org.apache.lucene.index.DocValues.checkField(DocValues.java:303)
at org.apache.lucene.index.DocValues.getBinary(DocValues.java:342)
at org.apache.lucene.search.FieldComparator$TermValComparator.getBinaryDocValues(FieldComparator.java:556)
at org.apache.lucene.search.FieldComparator$TermValComparator.getLeafComparator(FieldComparator.java:561)
at org.apache.lucene.search.FieldValueHitQueue.getComparators(FieldValueHitQueue.java:181)
at org.apache.lucene.search.TopFieldCollector$TopFieldLeafCollector.<init>(TopFieldCollector.java:64)
at org.apache.lucene.search.TopFieldCollector$SimpleFieldCollector$1.<init>(TopFieldCollector.java:196)
at org.apache.lucene.search.TopFieldCollector$SimpleFieldCollector.getLeafCollector(TopFieldCollector.java:196)
at org.apache.lucene.search.FilterCollector.getLeafCollector(FilterCollector.java:38)
at org.apache.lucene.search.AssertingCollector.getLeafCollector(AssertingCollector.java:45)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:737)
at org.apache.lucene.search.AssertingIndexSearcher.search(AssertingIndexSearcher.java:73)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:533)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:664)
at org.apache.lucene.search.IndexSearcher.searchAfter(IndexSearcher.java:645)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:548)
at org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringSort(TestFieldCacheSortRandom.java:171)
at org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort(TestFieldCacheSortRandom.java:70)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:566)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1754)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:942)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:978)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:44)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:45)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:819)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:470)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:951)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:836)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:887)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:898)
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:43)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:38)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.lambda$forkTimeoutingTask$0(ThreadLeakControl.java:826)
at java.base/java.lang.Thread.run(Thread.java:834)
Build Log:
[...truncated 856 lines...]
ERROR: The following test(s) have failed:
- org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort (:solr:core)
Test output: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/test-results/test/outputs/OUTPUT-org.apache.solr.uninverting.TestFieldCacheSortRandom.txt
Reproduce with: gradlew :solr:core:test --tests "org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort" -Ptests.jvms=4 -Ptests.haltonfailure=false -Ptests.jvmargs=-XX:TieredStopAtLevel=1 -Ptests.seed=A42271084D7F56EB -Ptests.multiplier=2 -Ptests.badapples=false -Ptests.file.encoding=UTF-8
Deprecated Gradle features were used in this build, making it incompatible with Gradle 7.0.
Use '--warning-mode all' to show the individual deprecation warnings.
See https://docs.gradle.org/6.6.1/userguide/command_line_interface.html#sec:command_line_warnings
BUILD SUCCESSFUL in 51m 51s
296 actionable tasks: 296 executed
Build step 'Invoke Gradle script' changed build result to SUCCESS
Archiving artifacts
java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath$ValidateAntFileMask.hasMatch(FilePath.java:3066)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2945)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2926)
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3313)
Also: hudson.remoting.Channel$CallSiteStackTrace: Remote call to lucene1
at hudson.remoting.Channel.attachCallSiteStackTrace(Channel.java:1800)
at hudson.remoting.UserRequest$ExceptionResponse.retrieve(UserRequest.java:357)
at hudson.remoting.Channel.call(Channel.java:1001)
at hudson.FilePath.act(FilePath.java:1157)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
Caused: hudson.FilePath$TunneledInterruptedException
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3315)
at hudson.remoting.UserRequest.perform(UserRequest.java:211)
at hudson.remoting.UserRequest.perform(UserRequest.java:54)
at hudson.remoting.Request$2.run(Request.java:375)
at hudson.remoting.InterceptingExecutorService$1.call(InterceptingExecutorService.java:73)
at java.util.concurrent.FutureTask.run(FutureTask.java:266)
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
at java.lang.Thread.run(Thread.java:748)
Caused: java.lang.InterruptedException: java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath.act(FilePath.java:1159)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
No artifacts found that match the file pattern "**/*.events,heapdumps/**,**/hs_err_pid*". Configuration error?
Recording test results
[Checks API] No suitable checks publisher found.
Build step 'Publish JUnit test result report' changed build result to UNSTABLE
Email was triggered for: Unstable (Test Failures)
Sending email for trigger: Unstable (Test Failures)
[JENKINS] Solr » Solr-Check-main - Build # 66 - Still Unstable!
Posted by Apache Jenkins Server <je...@builds.apache.org>.
Build: https://ci-builds.apache.org/job/Solr/job/Solr-Check-main/66/
2 tests failed.
FAILED: org.apache.solr.cloud.HttpPartitionTest.test
Error Message:
org.apache.solr.client.solrj.impl.BaseHttpSolrClient$RemoteSolrException: Error from server at http://127.0.0.1:34067/_ct/s: Underlying core creation failed while creating collection: collDoRecoveryOnRestart
Stack Trace:
org.apache.solr.client.solrj.impl.BaseHttpSolrClient$RemoteSolrException: Error from server at http://127.0.0.1:34067/_ct/s: Underlying core creation failed while creating collection: collDoRecoveryOnRestart
at __randomizedtesting.SeedInfo.seed([C6755113A8B2C715:4E216EC9064EAAED]:0)
at org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:698)
at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:269)
at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:251)
at org.apache.solr.client.solrj.SolrClient.request(SolrClient.java:1290)
at org.apache.solr.cloud.AbstractFullDistribZkTestBase.createCollection(AbstractFullDistribZkTestBase.java:1817)
at org.apache.solr.cloud.AbstractFullDistribZkTestBase.createCollection(AbstractFullDistribZkTestBase.java:1838)
at org.apache.solr.cloud.AbstractFullDistribZkTestBase.createCollection(AbstractFullDistribZkTestBase.java:1758)
at org.apache.solr.cloud.HttpPartitionTest.testDoRecoveryOnRestart(HttpPartitionTest.java:162)
at org.apache.solr.cloud.HttpPartitionTest.test(HttpPartitionTest.java:132)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:566)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1754)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:942)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:978)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1087)
at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1058)
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:44)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:45)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:819)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:470)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:951)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:836)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:887)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:898)
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:43)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:38)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.lambda$forkTimeoutingTask$0(ThreadLeakControl.java:826)
at java.base/java.lang.Thread.run(Thread.java:834)
FAILED: org.apache.solr.cloud.SolrCloudExampleTest.testLoadDocsIntoGettingStartedCollection
Error Message:
java.lang.AssertionError: Collection 'gettingstarted' doesn't exist after trying to create it!
Stack Trace:
java.lang.AssertionError: Collection 'gettingstarted' doesn't exist after trying to create it!
at __randomizedtesting.SeedInfo.seed([C6755113A8B2C715:D516637C99DD7EB3]:0)
at org.junit.Assert.fail(Assert.java:89)
at org.junit.Assert.assertTrue(Assert.java:42)
at org.apache.solr.cloud.SolrCloudExampleTest.testLoadDocsIntoGettingStartedCollection(SolrCloudExampleTest.java:103)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:566)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1754)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:942)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:978)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1087)
at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1058)
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:44)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:45)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:819)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:470)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:951)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:836)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:887)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:898)
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:43)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:38)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.lambda$forkTimeoutingTask$0(ThreadLeakControl.java:826)
at java.base/java.lang.Thread.run(Thread.java:834)
Build Log:
[...truncated 1450 lines...]
2> ERROR: Failed to create collection 'gettingstarted' due to: Underlying core creation failed while creating collection: gettingstarted
2>
2> 365371 WARN (closeThreadPool-3451-thread-2-SendThread(127.0.0.1:46251)) [ ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x103f0acd441000e.
2> => EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd441000e, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd441000e, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
2> 365384 WARN (closeThreadPool-3451-thread-4-SendThread(127.0.0.1:46251)) [ ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x103f0acd4410012.
2> => EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd4410012, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd4410012, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
2> 365394 WARN (closeThreadPool-3451-thread-3-SendThread(127.0.0.1:46251)) [ ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x103f0acd441000d.
2> => EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd441000d, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd441000d, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
2> 365443 INFO (closeThreadPool-3598-thread-4) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@170de6f3{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:0}
2> 365444 INFO (closeThreadPool-3598-thread-4) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@651d758b{/,null,STOPPED}
2> 365444 INFO (closeThreadPool-3598-thread-4) [ ] o.e.j.s.session node0 Stopped scavenging
2> 365496 INFO (closeThreadPool-3598-thread-5) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@63489317{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:0}
2> 365496 WARN (TEST-SolrCloudExampleTest.testLoadDocsIntoGettingStartedCollection-seed#[C6755113A8B2C715]-SendThread(127.0.0.1:46251)) [ ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x103f0acd4410004.
2> => EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd4410004, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd4410004, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
2> 365497 INFO (closeThreadPool-3598-thread-5) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@a92b79d{/,null,STOPPED}
2> 365497 INFO (closeThreadPool-3598-thread-5) [ ] o.e.j.s.session node0 Stopped scavenging
2> 365543 INFO (closeThreadPool-3598-thread-1) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@3aa5c10b{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:0}
2> 365543 INFO (closeThreadPool-3598-thread-1) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@3814d130{/,null,STOPPED}
2> 365543 INFO (closeThreadPool-3598-thread-1) [ ] o.e.j.s.session node0 Stopped scavenging
2> 365643 INFO (closeThreadPool-3598-thread-3) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@1b88afa2{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:0}
2> 365644 INFO (closeThreadPool-3598-thread-3) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@3d09d63{/,null,STOPPED}
2> 365644 INFO (closeThreadPool-3598-thread-3) [ ] o.e.j.s.session node0 Stopped scavenging
2> 365744 INFO (closeThreadPool-3598-thread-2) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@1aecb150{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:0}
2> 365744 INFO (closeThreadPool-3598-thread-2) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@621871c9{/,null,STOPPED}
2> 365744 INFO (closeThreadPool-3598-thread-2) [ ] o.e.j.s.session node0 Stopped scavenging
2> 369714 WARN (TEST-SolrCloudExampleTest.testLoadDocsIntoGettingStartedCollection-seed#[C6755113A8B2C715]-SendThread(127.0.0.1:46251)) [ ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x103f0acd4410001.
2> => EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd4410001, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x103f0acd4410001, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
2> 369818 WARN (ZkTestServer Run Thread) [ ] o.a.s.c.ZkTestServer Watch limit violations:
2> Maximum concurrent create/delete watches above limit:
2>
2> 9 /solr/collections/gettingstarted/terms/shard1
2> 8 /solr/collections/gettingstarted/terms/shard2
2> 8 /solr/clusterprops.json
2> 8 /solr/aliases.json
2> 7 /solr/collections/gettingstarted/state.json
2> 5 /solr/packages.json
2> 5 /solr/security.json
2> 5 /solr/configs/conf1
2> 5 /solr/collections/collection1/terms/shard1
2> 5 /solr/collections/collection1/terms/shard2
2> 4 /solr/collections/collection1/collectionprops.json
2> 4 /solr/configs/gettingstarted/managed-schema
2> 4 /solr/configs/gettingstarted
2> 2 /solr/collections/control_collection/terms/shard1
2>
2> Maximum concurrent data watches above limit:
2>
2> 102 /solr/collections/collection1/state.json
2> 53 /solr/collections/gettingstarted/state.json
2> 16 /solr/collections/control_collection/state.json
2> 2 /solr/overseer_elect/election/73166644054130701-127.0.0.1:46331_-n_0000000001
2> 2 /solr/overseer_elect/election/73166644054130702-127.0.0.1:39161_-n_0000000002
2>
2> Maximum concurrent children watches above limit:
2>
2> 74 /solr/overseer/queue
2> 37 /solr/live_nodes
2> 33 /solr/collections/collection1/state.json
2> 22 /solr/collections
2> 22 /solr/collections/gettingstarted/state.json
2> 19 /solr/overseer/collection-queue-work
2> 7 /solr/collections/control_collection/state.json
2>
> java.lang.AssertionError: Collection 'gettingstarted' doesn't exist after trying to create it!
> at __randomizedtesting.SeedInfo.seed([C6755113A8B2C715:D516637C99DD7EB3]:0)
> at org.junit.Assert.fail(Assert.java:89)
> at org.junit.Assert.assertTrue(Assert.java:42)
> at org.apache.solr.cloud.SolrCloudExampleTest.testLoadDocsIntoGettingStartedCollection(SolrCloudExampleTest.java:103)
> at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
> at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
> at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
> at java.base/java.lang.reflect.Method.invoke(Method.java:566)
> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1754)
> at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:942)
> at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:978)
> at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
> at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1087)
> at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1058)
> 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:44)
> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
> at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:45)
> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
> 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:370)
> at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:819)
> at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:470)
> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:951)
> at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:836)
> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:887)
> at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:898)
> 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:43)
> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
> at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:38)
> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
> at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:51)
> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
> at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.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:370)
> at com.carrotsearch.randomizedtesting.ThreadLeakControl.lambda$forkTimeoutingTask$0(ThreadLeakControl.java:826)
> at java.base/java.lang.Thread.run(Thread.java:834)
2> NOTE: reproduce with: gradlew test --tests SolrCloudExampleTest.testLoadDocsIntoGettingStartedCollection -Dtests.seed=C6755113A8B2C715 -Dtests.multiplier=2 -Dtests.slow=true -Dtests.locale=vun-TZ -Dtests.timezone=Asia/Dacca -Dtests.asserts=true -Dtests.file.encoding=UTF-8
2> NOTE: leaving temporary files on disk at: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.SolrCloudExampleTest_C6755113A8B2C715-001
2> Mar 16, 2021 6:36:41 AM com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
2> WARNING: Will linger awaiting termination of 1 leaked thread(s).
2> NOTE: test params are: codec=Asserting(Lucene90): {}, docValues:{}, maxPointsInLeafNode=822, maxMBSortInHeap=7.761496870959369, sim=Asserting(RandomSimilarity(queryNorm=true): {}), locale=vun-TZ, timezone=Asia/Dacca
2> NOTE: Linux 5.4.0-45-generic amd64/Oracle Corporation 11.0.9 (64-bit)/cpus=4,threads=1,free=112358840,total=290455552
2> NOTE: All tests run in this JVM: [TestPackages, UninvertDocValuesMergePolicyTest, SolrMetricReporterTest, SolrRrdBackendFactoryTest, SolrCloudReportersTest, SolrCoreMetricManagerTest, TestEmbeddedSolrServerAdminHandler, BinaryUpdateRequestHandlerTest, ResponseLogComponentTest, CustomHighlightComponentTest, DistributedQueryComponentCustomSortTest, FacetPivotSmallTest, TermVectorComponentTest, TestHttpShardHandlerFactory, DebugComponentTest, DistributedFacetPivotWhiteBoxTest, DistributedFacetExistsSmallTest, ShardsWhitelistTest, AdminHandlersProxyTest, InfoHandlerTest, V2CollectionsAPIMappingTest, CoreAdminRequestStatusTest, ThreadDumpHandlerTest, LukeRequestHandlerTest, MetricsHistoryHandlerTest, TestCoreAdminApis, TestContainerPlugin, TaggerTest, XmlInterpolationTest, FieldAnalysisRequestHandlerTest, TestIncrementalCoreBackup, DocumentAnalysisRequestHandlerTest, MoreLikeThisHandlerTest, BackupRestoreUtils, CSVRequestHandlerTest, HighlighterTest, HighlighterConfigTest, BaseTestRuleBasedAuthorizationPlugin, CertAuthPluginTest, TestZkAclsWithHadoopAuth, PKIAuthenticationIntegrationTest, JWTIssuerConfigTest, TestAuthorizationFramework, ConvertedLegacyTest, TestHighFrequencyDictionaryFactory, TestFuzzyAnalyzedSuggestions, TestAnalyzeInfixSuggestions, SpellCheckCollatorWithCollapseTest, FileBasedSpellCheckerTest, WordBreakSolrSpellCheckerTest, TestNumericRangeQuery64, TestNumericRangeQuery32, TestNumericTerms64, TestNumericTerms32, TestFieldCacheSortRandom, SmileWriterTest, TestRawResponseWriter, TestSubQueryTransformer, TestJavabinTupleStreamParser, TestCustomDocTransformer, TestDocumentBuilder, ProtectedTermFilterFactoryTest, TestCharFilters, OverseerSolrResponseUnsafeSerializationTest, TestConfigSetsAPI, SolrCloudExampleTest]
org.apache.solr.cloud.HttpPartitionTest > test suite's output saved to /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/test-results/test/outputs/OUTPUT-org.apache.solr.cloud.HttpPartitionTest.txt, copied below:
2> 338987 INFO (SUITE-HttpPartitionTest-seed#[C6755113A8B2C715]-worker) [ ] o.a.s.SolrTestCase Setting 'solr.default.confdir' system property to test-framework derived value of '/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/server/solr/configsets/_default/conf'
2> 338987 INFO (SUITE-HttpPartitionTest-seed#[C6755113A8B2C715]-worker) [ ] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
2> 338987 INFO (SUITE-HttpPartitionTest-seed#[C6755113A8B2C715]-worker) [ ] o.a.s.SolrTestCaseJ4 Created dataDir: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/data-dir-71-001
2> 338988 WARN (SUITE-HttpPartitionTest-seed#[C6755113A8B2C715]-worker) [ ] o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=13 numCloses=13
2> 338988 INFO (SUITE-HttpPartitionTest-seed#[C6755113A8B2C715]-worker) [ ] o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true) w/NUMERIC_DOCVALUES_SYSPROP=false
2> 338988 INFO (SUITE-HttpPartitionTest-seed#[C6755113A8B2C715]-worker) [ ] o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (false) via: @org.apache.solr.SolrTestCaseJ4$SuppressSSL(bugUrl="https://issues.apache.org/jira/browse/SOLR-5776")
2> 338988 INFO (SUITE-HttpPartitionTest-seed#[C6755113A8B2C715]-worker) [ ] o.a.s.BaseDistributedSearchTestCase Setting hostContext system property: /_ct/s
2> 339118 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
2> 339133 INFO (ZkTestServer Run Thread) [ ] o.a.s.c.ZkTestServer client port: 0.0.0.0/0.0.0.0:0
2> 339133 INFO (ZkTestServer Run Thread) [ ] o.a.s.c.ZkTestServer Starting server
2> 339134 WARN (ZkTestServer Run Thread) [ ] o.a.z.s.ServerCnxnFactory maxCnxns is not configured, using default value 0.
2> 339312 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer start zk server on port: 42831
2> 339312 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer waitForServerUp: 127.0.0.1:42831
2> 339312 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:42831
2> 339312 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1 42831
2> 339341 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 339372 INFO (zkConnectionManagerCallback-3922-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 339373 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 339426 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 339429 INFO (zkConnectionManagerCallback-3924-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 339429 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 339431 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/solrconfig-tlog.xml to /configs/conf1/solrconfig.xml
2> 339433 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/schema.xml to /configs/conf1/schema.xml
2> 339434 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/solrconfig.snippet.randomindexconfig.xml to /configs/conf1/solrconfig.snippet.randomindexconfig.xml
2> 339435 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/stopwords.txt to /configs/conf1/stopwords.txt
2> 339436 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/protwords.txt to /configs/conf1/protwords.txt
2> 339437 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/currency.xml to /configs/conf1/currency.xml
2> 339438 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/enumsConfig.xml to /configs/conf1/enumsConfig.xml
2> 339439 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/open-exchange-rates.json to /configs/conf1/open-exchange-rates.json
2> 339444 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/mapping-ISOLatin1Accent.txt to /configs/conf1/mapping-ISOLatin1Accent.txt
2> 339445 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/old_synonyms.txt to /configs/conf1/old_synonyms.txt
2> 339446 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkTestServer put /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/resources/test/solr/collection1/conf/synonyms.txt to /configs/conf1/synonyms.txt
2> 339447 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.AbstractFullDistribZkTestBase Will use NRT replicas unless explicitly asked otherwise
2> 339560 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
2> 339560 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
2> 339560 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.s.Server jetty-9.4.34.v20201102; built: 2020-11-02T14:15:39.302Z; git: e46af88704a893fc12cb0e3bf46e2c7b48a009e7; jvm 11.0.9+7-LTS
2> 339787 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0
2> 339788 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.s.session No SessionScavenger set, using defaults
2> 339788 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.s.session node0 Scavenging every 600000ms
2> 339810 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@40837f12{/_ct/s,null,AVAILABLE}
2> 339810 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@55717256{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:33471}
2> 339810 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.s.Server Started @339859ms
2> 339810 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/_ct/s, solr.data.dir=/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/tempDir-001/control/data, hostPort=42497, coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/control-001/cores}
2> 339811 ERROR (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
2> 339811 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
2> 339811 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version 9.0.0
2> 339811 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
2> 339811 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr
2> 339811 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2021-03-16T06:36:11.328229Z
2> 339811 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.s.SolrDispatchFilter Solr Home: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/control-001 (source: servlet config: solr.solr.home)
2> 339820 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 339820 INFO (zkConnectionManagerCallback-3926-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 339821 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 339922 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in ZooKeeper)
2> 339922 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/control-001/solr.xml
2> 339926 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3, but no JMX reporters were configured - adding default JMX reporter.
2> 341563 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
2> 341572 WARN (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@79e1211a[provider=null,keyStore=null,trustStore=null]
2> 341572 WARN (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@79e1211a[provider=null,keyStore=null,trustStore=null]
2> 341598 WARN (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@7b93506a[provider=null,keyStore=null,trustStore=null]
2> 341598 WARN (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@7b93506a[provider=null,keyStore=null,trustStore=null]
2> 341599 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42831/solr
2> 341610 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 341611 INFO (zkConnectionManagerCallback-3936-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 341611 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 341900 WARN (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]-SendThread(127.0.0.1:42831)) [ ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x103f0ace35d0003.
2> => EndOfStreamException: Unable to read additional data from server sessionid 0x103f0ace35d0003, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x103f0ace35d0003, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
2> 342001 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.DistributedClusterStateUpdater Creating DistributedClusterStateUpdater with useDistributedStateUpdate=false. Solr will be using Overseer based cluster state updates.
2> 342010 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 342017 INFO (zkConnectionManagerCallback-3938-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 342017 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 342177 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.DistributedClusterStateUpdater Creating DistributedClusterStateUpdater with useDistributedStateUpdate=false. Solr will be using Overseer based cluster state updates.
2> 342181 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:42497__ct%2Fs
2> 342182 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.Overseer Overseer (id=73166644307623940-127.0.0.1:42497__ct%2Fs-n_0000000000) starting
2> 342195 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:42497__ct%2Fs
2> 342196 INFO (OverseerStateUpdate-73166644307623940-127.0.0.1:42497__ct%2Fs-n_0000000000) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:42497__ct%2Fs
2> 342199 INFO (OverseerStateUpdate-73166644307623940-127.0.0.1:42497__ct%2Fs-n_0000000000) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
2> 342200 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.p.PackageLoader /packages.json updated to version -1
2> 342200 WARN (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] 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
2> 342201 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.DistributedClusterStateUpdater Creating DistributedClusterStateUpdater with useDistributedStateUpdate=false. Solr will be using Overseer based cluster state updates.
2> 342210 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
2> 342245 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3
2> 342253 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3
2> 342253 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3
2> 342255 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/control-001/cores
2> 342276 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Waiting up to 15000ms for client to connect to ZooKeeper
2> 342278 INFO (zkConnectionManagerCallback-3953-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 342278 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 342282 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
2> 342284 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:42831/solr ready
2> 342285 INFO (SocketProxy-Acceptor-42497) [ ] o.a.s.c.s.c.SocketProxy accepted Socket[addr=/127.0.0.1,port=46124,localport=42497], receiveBufferSize: 65536
2> 342289 INFO (SocketProxy-Acceptor-42497) [ ] o.a.s.c.s.c.SocketProxy proxy connection Socket[addr=/127.0.0.1,port=33471,localport=53846], receiveBufferSize=65536
2> 342304 INFO (OverseerThreadFactory-3943-thread-1-processing-n:127.0.0.1:42497__ct%2Fs) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.a.c.CreateCollectionCmd Create collection control_collection
2> 342415 INFO (OverseerStateUpdate-73166644307623940-127.0.0.1:42497__ct%2Fs-n_0000000000) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.o.SliceMutator createReplica() {
2> "operation":"ADDREPLICA",
2> "collection":"control_collection",
2> "shard":"shard1",
2> "core":"control_collection_shard1_replica_n1",
2> "state":"down",
2> "node_name":"127.0.0.1:42497__ct%2Fs",
2> "type":"NRT",
2> "waitForFinalState":"false"}
2> 342758 INFO (zkCallback-3937-thread-1) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/control_collection/state.json] for collection [control_collection] has occurred - updating... (live nodes size: [1])
2> 342763 INFO (SocketProxy-Acceptor-42497) [ ] o.a.s.c.s.c.SocketProxy accepted Socket[addr=/127.0.0.1,port=46134,localport=42497], receiveBufferSize: 65536
2> 342764 INFO (SocketProxy-Acceptor-42497) [ ] o.a.s.c.s.c.SocketProxy proxy connection Socket[addr=/127.0.0.1,port=33471,localport=53856], receiveBufferSize=65536
2> 342766 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs x:control_collection_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node2&collection.configName=conf1&newCollection=true&name=control_collection_shard1_replica_n1&action=CREATE&numShards=1&collection=control_collection&shard=shard1&wt=javabin&version=2&replicaType=NRT
2> 342767 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs x:control_collection_shard1_replica_n1 ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 transient cores
2> 342782 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 9.0.0
2> 342796 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.s.IndexSchema Schema name=test
2> 342807 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.s.IndexSchema Loaded schema test/1.0 with uniqueid field id
2> 342824 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.CoreContainer Creating SolrCore 'control_collection_shard1_replica_n1' using configuration from configset conf1, trusted=true
2> 342824 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.control_collection.shard1.replica_n1' (registry 'solr.core.control_collection.shard1.replica_n1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3
2> 342824 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.SolrCore [[control_collection_shard1_replica_n1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/control-001/cores/control_collection_shard1_replica_n1], dataDir=[/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/control-001/cores/control_collection_shard1_replica_n1/data/]
2> 342826 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: minMergeSize=1000, mergeFactor=49, maxMergeSize=9223372036854775807, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0]
2> 342830 WARN (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.RequestHandlers INVALID paramSet a in requestHandler {type = requestHandler,name = /dump,class = DumpRequestHandler,attributes = {initParams=a, name=/dump, class=DumpRequestHandler},args = {defaults={a=A, b=B}}}
2> 342865 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
2> 342865 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
2> 342867 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
2> 342867 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
2> 342867 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: minMergeSize=1000, mergeFactor=44, maxMergeSize=9223372036854775807, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.6494411042684668]
2> 342869 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf1
2> 342870 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf1
2> 342871 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
2> 342871 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1694369394865471488
2> 342874 INFO (searcherExecutor-3955-thread-1-processing-n:127.0.0.1:42497__ct%2Fs x:control_collection_shard1_replica_n1 c:control_collection s:shard1 r:core_node2) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.SolrCore [control_collection_shard1_replica_n1] Registered new searcher autowarm time: 0 ms
2> 342881 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/control_collection/terms/shard1 to Terms{values={core_node2=0}, version=0} for registerTerm
2> 342881 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/control_collection/leaders/shard1
2> 342886 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
2> 342886 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
2> 342886 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync replicas to http://127.0.0.1:42497/_ct/s/control_collection_shard1_replica_n1/
2> 342888 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
2> 342890 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.SyncStrategy http://127.0.0.1:42497/_ct/s/control_collection_shard1_replica_n1/ has no replicas
2> 342890 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node /collections/control_collection/leaders/shard1/leader after winning as /collections/control_collection/leader_elect/shard1/election/73166644307623940-core_node2-n_0000000000
2> 342894 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I am the new leader: http://127.0.0.1:42497/_ct/s/control_collection_shard1_replica_n1/ shard1
2> 342997 INFO (zkCallback-3937-thread-3) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/control_collection/state.json] for collection [control_collection] has occurred - updating... (live nodes size: [1])
2> 343000 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs c:control_collection s:shard1 r:core_node2 x:control_collection_shard1_replica_n1 ] o.a.s.c.ZkController I am the leader, no recovery necessary
2> 343010 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node2&collection.configName=conf1&newCollection=true&name=control_collection_shard1_replica_n1&action=CREATE&numShards=1&collection=control_collection&shard=shard1&wt=javabin&version=2&replicaType=NRT} status=0 QTime=243
2> 343015 INFO (qtp541019975-5300) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 45 seconds. Check all shard replicas
2> 343265 INFO (zkCallback-3937-thread-3) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/control_collection/state.json] for collection [control_collection] has occurred - updating... (live nodes size: [1])
2> 343265 INFO (zkCallback-3937-thread-2) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/control_collection/state.json] for collection [control_collection] has occurred - updating... (live nodes size: [1])
2> 343268 INFO (qtp541019975-5300) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections params={collection.configName=conf1&name=control_collection&nrtReplicas=1&action=CREATE&numShards=1&createNodeSet=127.0.0.1:42497__ct%252Fs&wt=javabin&version=2} status=0 QTime=970
2> 343269 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.AbstractFullDistribZkTestBase Waiting to see 1 active replicas in collection: control_collection
2> 343276 WARN (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]-SendThread(127.0.0.1:42831)) [ ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x103f0ace35d0005.
2> => EndOfStreamException: Unable to read additional data from server sessionid 0x103f0ace35d0005, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x103f0ace35d0005, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
2> 343384 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Waiting up to 15000ms for client to connect to ZooKeeper
2> 343385 INFO (zkConnectionManagerCallback-3964-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 343385 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 343390 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
2> 343393 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:42831/solr ready
2> 343393 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.ChaosMonkey monkey: init - expire sessions:false cause connection loss:false
2> 343397 INFO (SocketProxy-Acceptor-42497) [ ] o.a.s.c.s.c.SocketProxy accepted Socket[addr=/127.0.0.1,port=46154,localport=42497], receiveBufferSize: 65536
2> 343420 INFO (SocketProxy-Acceptor-42497) [ ] o.a.s.c.s.c.SocketProxy proxy connection Socket[addr=/127.0.0.1,port=33471,localport=53876], receiveBufferSize=65536
2> 343435 INFO (OverseerThreadFactory-3943-thread-2-processing-n:127.0.0.1:42497__ct%2Fs) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.a.c.CreateCollectionCmd Create collection collection1
2> 343435 INFO (OverseerCollectionConfigSetProcessor-73166644307623940-127.0.0.1:42497__ct%2Fs-n_0000000000) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.OverseerTaskQueue Response ZK path: /overseer/collection-queue-work/qnr-0000000000 doesn't exist. Requestor may have disconnected from ZooKeeper
2> 343641 WARN (OverseerThreadFactory-3943-thread-2-processing-n:127.0.0.1:42497__ct%2Fs) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.a.c.CreateCollectionCmd It is unusual to create a collection (collection1) without cores.
2> 343642 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 45 seconds. Check all shard replicas
2> 343647 INFO (qtp541019975-5303) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections params={collection.configName=conf1&name=collection1&nrtReplicas=1&action=CREATE&numShards=2&createNodeSet=&wt=javabin&version=2} status=0 QTime=226
2> 343649 INFO (watches-3961-thread-1) [ ] o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
2> 343649 INFO (watches-3961-thread-1) [ ] o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
2> 343649 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
2> 343649 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
2> 343649 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
2> 343649 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
2> 343649 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
2> 343649 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
2> 343649 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.AbstractFullDistribZkTestBase Creating jetty instances pullReplicaCount=0 numOtherReplicas=3
2> 343765 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.AbstractFullDistribZkTestBase create jetty 1 in directory /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-1-001 of type NRT for shard2
2> 343954 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
2> 343954 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
2> 343954 INFO (closeThreadPool-3965-thread-1) [ ] o.e.j.s.Server jetty-9.4.34.v20201102; built: 2020-11-02T14:15:39.302Z; git: e46af88704a893fc12cb0e3bf46e2c7b48a009e7; jvm 11.0.9+7-LTS
2> 344029 INFO (closeThreadPool-3965-thread-1) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0
2> 344029 INFO (closeThreadPool-3965-thread-1) [ ] o.e.j.s.session No SessionScavenger set, using defaults
2> 344029 INFO (closeThreadPool-3965-thread-1) [ ] o.e.j.s.session node0 Scavenging every 660000ms
2> 344033 INFO (closeThreadPool-3965-thread-1) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@33826956{/_ct/s,null,AVAILABLE}
2> 344035 INFO (closeThreadPool-3965-thread-1) [ ] o.e.j.s.AbstractConnector Started ServerConnector@6cb16aac{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:43957}
2> 344035 INFO (closeThreadPool-3965-thread-1) [ ] o.e.j.s.Server Started @344083ms
2> 344035 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/_ct/s, solrconfig=solrconfig.xml, solr.data.dir=/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/tempDir-001/jetty1, hostPort=36353, coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-1-001/cores}
2> 344035 ERROR (closeThreadPool-3965-thread-1) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
2> 344035 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
2> 344036 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version 9.0.0
2> 344036 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
2> 344036 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr
2> 344036 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2021-03-16T06:36:15.553217Z
2> 344036 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.s.SolrDispatchFilter Solr Home: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-1-001 (source: servlet config: solr.solr.home)
2> 344053 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.AbstractFullDistribZkTestBase create jetty 2 in directory /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-2-001 of type NRT for shard1
2> 344053 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 344064 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
2> 344064 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
2> 344064 INFO (closeThreadPool-3965-thread-2) [ ] o.e.j.s.Server jetty-9.4.34.v20201102; built: 2020-11-02T14:15:39.302Z; git: e46af88704a893fc12cb0e3bf46e2c7b48a009e7; jvm 11.0.9+7-LTS
2> 344064 INFO (zkConnectionManagerCallback-3967-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 344065 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 344089 WARN (closeThreadPool-3965-thread-1-SendThread(127.0.0.1:42831)) [ ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x103f0ace35d0007.
2> => EndOfStreamException: Unable to read additional data from server sessionid 0x103f0ace35d0007, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x103f0ace35d0007, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
2> 344091 INFO (closeThreadPool-3965-thread-2) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0
2> 344091 INFO (closeThreadPool-3965-thread-2) [ ] o.e.j.s.session No SessionScavenger set, using defaults
2> 344091 INFO (closeThreadPool-3965-thread-2) [ ] o.e.j.s.session node0 Scavenging every 660000ms
2> 344096 INFO (closeThreadPool-3965-thread-2) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@299b5e6c{/_ct/s,null,AVAILABLE}
2> 344097 INFO (closeThreadPool-3965-thread-2) [ ] o.e.j.s.AbstractConnector Started ServerConnector@7ce068e9{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:40299}
2> 344097 INFO (closeThreadPool-3965-thread-2) [ ] o.e.j.s.Server Started @344145ms
2> 344097 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/_ct/s, solrconfig=solrconfig.xml, solr.data.dir=/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/tempDir-001/jetty2, hostPort=34067, coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-2-001/cores}
2> 344097 ERROR (closeThreadPool-3965-thread-2) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
2> 344097 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
2> 344097 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version 9.0.0
2> 344097 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
2> 344097 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr
2> 344097 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2021-03-16T06:36:15.614710Z
2> 344097 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.s.SolrDispatchFilter Solr Home: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-2-001 (source: servlet config: solr.solr.home)
2> 344105 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 344106 INFO (zkConnectionManagerCallback-3969-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 344106 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 344152 INFO (TEST-HttpPartitionTest.test-seed#[C6755113A8B2C715]) [ ] o.a.s.c.AbstractFullDistribZkTestBase create jetty 3 in directory /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-3-001 of type NRT for shard2
2> 344154 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
2> 344154 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
2> 344154 INFO (closeThreadPool-3965-thread-3) [ ] o.e.j.s.Server jetty-9.4.34.v20201102; built: 2020-11-02T14:15:39.302Z; git: e46af88704a893fc12cb0e3bf46e2c7b48a009e7; jvm 11.0.9+7-LTS
2> 344156 INFO (closeThreadPool-3965-thread-3) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0
2> 344157 INFO (closeThreadPool-3965-thread-3) [ ] o.e.j.s.session No SessionScavenger set, using defaults
2> 344157 INFO (closeThreadPool-3965-thread-3) [ ] o.e.j.s.session node0 Scavenging every 660000ms
2> 344157 INFO (closeThreadPool-3965-thread-3) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@7568ce1a{/_ct/s,null,AVAILABLE}
2> 344157 INFO (closeThreadPool-3965-thread-3) [ ] o.e.j.s.AbstractConnector Started ServerConnector@42b62752{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:41809}
2> 344157 INFO (closeThreadPool-3965-thread-3) [ ] o.e.j.s.Server Started @344206ms
2> 344158 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/_ct/s, solrconfig=solrconfig.xml, solr.data.dir=/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/tempDir-001/jetty3, hostPort=42529, coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-3-001/cores}
2> 344158 ERROR (closeThreadPool-3965-thread-3) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
2> 344158 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
2> 344158 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version 9.0.0
2> 344158 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
2> 344158 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr
2> 344158 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2021-03-16T06:36:15.675398Z
2> 344158 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.s.SolrDispatchFilter Solr Home: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-3-001 (source: servlet config: solr.solr.home)
2> 344277 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in ZooKeeper)
2> 344277 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-1-001/solr.xml
2> 344278 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 344286 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3, but no JMX reporters were configured - adding default JMX reporter.
2> 344301 INFO (zkConnectionManagerCallback-3971-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 344301 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 344383 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in ZooKeeper)
2> 344383 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-2-001/solr.xml
2> 344386 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3, but no JMX reporters were configured - adding default JMX reporter.
2> 344482 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in ZooKeeper)
2> 344482 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.SolrXmlConfig Loading container configuration from /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-3-001/solr.xml
2> 344487 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3, but no JMX reporters were configured - adding default JMX reporter.
2> 345046 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
2> 345048 WARN (closeThreadPool-3965-thread-1) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@68be4253[provider=null,keyStore=null,trustStore=null]
2> 345048 WARN (closeThreadPool-3965-thread-1) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@68be4253[provider=null,keyStore=null,trustStore=null]
2> 345057 WARN (closeThreadPool-3965-thread-1) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@48e886d4[provider=null,keyStore=null,trustStore=null]
2> 345057 WARN (closeThreadPool-3965-thread-1) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@48e886d4[provider=null,keyStore=null,trustStore=null]
2> 345059 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42831/solr
2> 345061 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 345062 INFO (zkConnectionManagerCallback-3987-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 345062 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 345084 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
2> 345084 WARN (closeThreadPool-3965-thread-2) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@206acbd1[provider=null,keyStore=null,trustStore=null]
2> 345084 WARN (closeThreadPool-3965-thread-2) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@206acbd1[provider=null,keyStore=null,trustStore=null]
2> 345223 WARN (closeThreadPool-3965-thread-2) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@209c784d[provider=null,keyStore=null,trustStore=null]
2> 345223 WARN (closeThreadPool-3965-thread-2) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@209c784d[provider=null,keyStore=null,trustStore=null]
2> 345223 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.DistributedClusterStateUpdater Creating DistributedClusterStateUpdater with useDistributedStateUpdate=false. Solr will be using Overseer based cluster state updates.
2> 345224 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42831/solr
2> 345225 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 345226 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 345228 INFO (zkConnectionManagerCallback-3994-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 345228 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 345229 INFO (zkConnectionManagerCallback-3996-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 345230 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 345235 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
2> 345237 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.c.DistributedClusterStateUpdater Creating DistributedClusterStateUpdater with useDistributedStateUpdate=false. Solr will be using Overseer based cluster state updates.
2> 345240 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.c.ZkController Publish node=127.0.0.1:36353__ct%2Fs as DOWN
2> 345242 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 transient cores
2> 345242 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:36353__ct%2Fs
2> 345244 INFO (zkCallback-3937-thread-2) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
2> 345246 INFO (zkCallback-3963-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
2> 345247 INFO (zkCallback-3993-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
2> 345251 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.p.PackageLoader /packages.json updated to version -1
2> 345252 WARN (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] 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
2> 345252 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.c.DistributedClusterStateUpdater Creating DistributedClusterStateUpdater with useDistributedStateUpdate=false. Solr will be using Overseer based cluster state updates.
2> 345263 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
2> 345286 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3
2> 345297 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3
2> 345297 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3
2> 345298 INFO (closeThreadPool-3965-thread-1) [n:127.0.0.1:36353__ct%2Fs ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/tmp/tests-tmp/solr.cloud.HttpPartitionTest_C6755113A8B2C715-001/shard-1-001/cores
2> 345304 INFO (closeThreadPool-3965-thread-1) [ ] o.a.s.c.AbstractFullDistribZkTestBase waitForLiveNode: 127.0.0.1:36353__ct%2Fs
2> 345333 INFO (closeThreadPool-3965-thread-2) [ ] o.a.s.c.DistributedClusterStateUpdater Creating DistributedClusterStateUpdater with useDistributedStateUpdate=false. Solr will be using Overseer based cluster state updates.
2> 345336 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 345337 INFO (zkConnectionManagerCallback-4006-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 345337 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 345340 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2)
2> 345342 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.c.DistributedClusterStateUpdater Creating DistributedClusterStateUpdater with useDistributedStateUpdate=false. Solr will be using Overseer based cluster state updates.
2> 345344 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.c.ZkController Publish node=127.0.0.1:34067__ct%2Fs as DOWN
2> 345345 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 transient cores
2> 345345 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:34067__ct%2Fs
2> 345346 INFO (zkCallback-3937-thread-2) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
2> 345346 INFO (zkCallback-3963-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
2> 345346 INFO (zkCallback-3993-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
2> 345347 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
2> 345348 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.p.PackageLoader /packages.json updated to version -1
2> 345348 WARN (closeThreadPool-3965-thread-3) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@1692d1ab[provider=null,keyStore=null,trustStore=null]
2> 345348 WARN (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] 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
2> 345422 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.c.DistributedClusterStateUpdater Creating DistributedClusterStateUpdater with useDistributedStateUpdate=false. Solr will be using Overseer based cluster state updates.
2> 345425 WARN (closeThreadPool-3965-thread-3) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@1692d1ab[provider=null,keyStore=null,trustStore=null]
2> 345428 INFO (zkCallback-4005-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
2> 345428 WARN (closeThreadPool-3965-thread-3) [ ] o.e.j.u.s.S.config Trusting all certificates configured for Client@76e0b94e[provider=null,keyStore=null,trustStore=null]
2> 345428 WARN (closeThreadPool-3965-thread-3) [ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@76e0b94e[provider=null,keyStore=null,trustStore=null]
2> 345430 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42831/solr
2> 345432 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
2> 345435 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.c.ConnectionManager Waiting up to 30000ms for client to connect to ZooKeeper
2> 345435 INFO (zkConnectionManagerCallback-4017-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected
2> 345435 INFO (closeThreadPool-3965-thread-3) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
2> 345436 WARN (closeThreadPool-3965-thread-3-SendThread(127.0.0.1:42831)) [ ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x103f0ace35d000e.
2> => EndOfStreamException: Unable to read additional data from server sessionid 0x103f0ace35d000e, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x103f0ace35d000e, likely server has closed socket
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
2> at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
2> 345439 INFO (OverseerCollectionConfigSetProcessor-73166644307623940-127.0.0.1:42497__ct%2Fs-n_0000000000) [n:127.0.0.1:42497__ct%2Fs ] o.a.s.c.OverseerTaskQueue Response ZK path: /overseer/collection-queue-work/qnr-0000000002 doesn't exist. Requestor may have disconnected from ZooKeeper
2> 345456 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3
2> 345483 INFO (closeThreadPool-3965-thread-2) [n:127.0.0.1:34067__ct%2Fs ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@294c0f3
2> 345483 INFO (cl
[...truncated too long message...]
alJavadocLinksSite
Processed 2493 links (1982 relative) to 3742 anchors in 252 files
> Task :solr:solr-ref-guide:prepareSiteSources
Syncing source files to /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/solr-ref-guide/build/html-site-content using props:
htmlSolrJavadocs -> https://lucene.apache.org/solr/9_0_0/
htmlLuceneJavadocs -> https://lucene.apache.org/core/9_0_0/
htmlOutDir -> ../html-site
javadocLink -> https://docs.oracle.com/en/java/javase/11/docs/api/
solrGuideDraftStatus -> DRAFT
solrRootPath -> /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/
solrDocsVersion -> 9.0
solrGuideVersionPath -> 9_0
buildDate -> 2021-03-16
buildYear -> 2021
ivyCommonsCodec -> 1.13
ivyDropwizardMetrics -> 4.1.5
ivyLog4j -> 2.13.2
ivyOpennlpTools -> 1.9.1
ivyTika -> 1.24
ivyZookeeper -> 3.6.2
Building up tree of all known pages
WARNING: An illegal reflective access operation has occurred
WARNING: Illegal reflective access by org.jruby.util.SecurityHelper (file:/home/jenkins/.gradle/caches/modules-2/files-2.1/org.jruby/jruby-core/9.2.6.0/653601d48b38528e76840c6eac1ae46e2dae1a74/jruby-core-9.2.6.0.jar) to field java.lang.reflect.Field.modifiers
WARNING: Please consider reporting this to the maintainers of org.jruby.util.SecurityHelper
WARNING: Use --illegal-access=warn to enable warnings of further illegal reflective access operations
WARNING: All illegal access operations will be denied in a future release
Looping over pages to build nav data
Creating /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/solr-ref-guide/build/html-site-content/_data/scrollnav.json
Creating /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/solr-ref-guide/build/html-site-content/_data/sidebar.json
> Task :solr:solr-ref-guide:buildSite
WARNING: An illegal reflective access operation has occurred
WARNING: Illegal reflective access by com.headius.backport9.modules.Modules (file:/home/jenkins/.gradle/caches/modules-2/files-2.1/org.jruby/jruby-complete/9.2.9.0/8e44ce7a1417966d89957bd766a148601e28828b/jruby-complete-9.2.9.0.jar) to method sun.nio.ch.NativeThread.signal(long)
WARNING: Please consider reporting this to the maintainers of com.headius.backport9.modules.Modules
WARNING: Use --illegal-access=warn to enable warnings of further illegal reflective access operations
WARNING: All illegal access operations will be denied in a future release
Configuration file: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/solr-ref-guide/build/html-site-content/_config.yml
Source: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/solr-ref-guide/build/html-site-content
Destination: ../html-site
Incremental build: disabled. Enable with --incremental
Generating...
asciidoctor: WARNING: skipping reference to missing attribute: config_name
asciidoctor: WARNING: skipping reference to missing attribute: file_name
done in 30.219 seconds.
Auto-regeneration: disabled. Use --watch to enable.
> Task :solr:solr-ref-guide:checkSite
Processed 2493 links (1799 relative) to 3742 anchors in 252 files
> Task :solr:solr-ref-guide:check
> Task :solr:solrj:check
> Task :solr:test-framework:check
> Task :solr:webapp:check
> Task :solr:contrib:analysis-extras:check
> Task :solr:contrib:analytics:check
> Task :solr:contrib:clustering:check
> Task :solr:contrib:extraction:check
> Task :solr:contrib:jaegertracer-configurator:check
> Task :solr:contrib:langid:check
> Task :solr:contrib:ltr:check
> Task :solr:contrib:prometheus-exporter:check
> Task :solr:contrib:scripting:check
The slowest tests (exceeding 500 ms) during this run:
406.60s TestIntervalFaceting.testRandom (:solr:core)
169.76s AffinityPlacementFactoryTest.testScalability (:solr:core)
148.14s TestRandomCollapseQParserPlugin.testRandomCollpaseWithSort (:solr:core)
131.33s TestStressLiveNodes.testStress (:solr:core)
100.46s TestDistributedSearch.test (:solr:core)
71.93s TestLeaderElectionZkExpiry.testLeaderElectionWithZkExpiry (:solr:core)
64.29s TestDistributedStatsComponentCardinality.test (:solr:core)
62.57s PeerSyncReplicationTest.test (:solr:core)
61.82s ZkControllerTest.testReadConfigName (:solr:core)
61.75s ZkControllerTest.testPublishAndWaitForDownStates (:solr:core)
The slowest suites (exceeding 1s) during this run:
407.87s TestIntervalFaceting (:solr:core)
268.99s TestJsonFacets (:solr:core)
185.98s ZkControllerTest (:solr:core)
170.68s AffinityPlacementFactoryTest (:solr:core)
158.30s ShardSplitTest (:solr:core)
156.48s TestRandomCollapseQParserPlugin (:solr:core)
142.54s TestReplicationHandler (:solr:core)
133.04s TestStressLiveNodes (:solr:core)
119.55s SoftAutoCommitTest (:solr:core)
106.01s SpatialHeatmapFacetsTest (:solr:core)
ERROR: The following test(s) have failed:
- org.apache.solr.cloud.SolrCloudExampleTest.testLoadDocsIntoGettingStartedCollection (:solr:core)
Test output: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/test-results/test/outputs/OUTPUT-org.apache.solr.cloud.SolrCloudExampleTest.txt
Reproduce with: gradlew :solr:core:test --tests "org.apache.solr.cloud.SolrCloudExampleTest.testLoadDocsIntoGettingStartedCollection" -Ptests.jvms=4 -Ptests.haltonfailure=false -Ptests.jvmargs=-XX:TieredStopAtLevel=1 -Ptests.seed=C6755113A8B2C715 -Ptests.multiplier=2 -Ptests.badapples=false -Ptests.file.encoding=UTF-8
- org.apache.solr.cloud.HttpPartitionTest.test (:solr:core)
Test output: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/test-results/test/outputs/OUTPUT-org.apache.solr.cloud.HttpPartitionTest.txt
Reproduce with: gradlew :solr:core:test --tests "org.apache.solr.cloud.HttpPartitionTest.test" -Ptests.jvms=4 -Ptests.haltonfailure=false -Ptests.jvmargs=-XX:TieredStopAtLevel=1 -Ptests.seed=C6755113A8B2C715 -Ptests.multiplier=2 -Ptests.badapples=false -Ptests.file.encoding=UTF-8
Deprecated Gradle features were used in this build, making it incompatible with Gradle 7.0.
Use '--warning-mode all' to show the individual deprecation warnings.
See https://docs.gradle.org/6.6.1/userguide/command_line_interface.html#sec:command_line_warnings
BUILD SUCCESSFUL in 55m 35s
296 actionable tasks: 296 executed
Build step 'Invoke Gradle script' changed build result to SUCCESS
Archiving artifacts
java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath$ValidateAntFileMask.hasMatch(FilePath.java:3066)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2945)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2926)
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3313)
Also: hudson.remoting.Channel$CallSiteStackTrace: Remote call to lucene2
at hudson.remoting.Channel.attachCallSiteStackTrace(Channel.java:1800)
at hudson.remoting.UserRequest$ExceptionResponse.retrieve(UserRequest.java:357)
at hudson.remoting.Channel.call(Channel.java:1001)
at hudson.FilePath.act(FilePath.java:1157)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
Caused: hudson.FilePath$TunneledInterruptedException
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3315)
at hudson.remoting.UserRequest.perform(UserRequest.java:211)
at hudson.remoting.UserRequest.perform(UserRequest.java:54)
at hudson.remoting.Request$2.run(Request.java:375)
at hudson.remoting.InterceptingExecutorService$1.call(InterceptingExecutorService.java:73)
at java.util.concurrent.FutureTask.run(FutureTask.java:266)
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
at java.lang.Thread.run(Thread.java:748)
Caused: java.lang.InterruptedException: java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath.act(FilePath.java:1159)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
No artifacts found that match the file pattern "**/*.events,heapdumps/**,**/hs_err_pid*". Configuration error?
Recording test results
[Checks API] No suitable checks publisher found.
Build step 'Publish JUnit test result report' changed build result to UNSTABLE
Email was triggered for: Unstable (Test Failures)
Sending email for trigger: Unstable (Test Failures)
[JENKINS] Solr » Solr-Check-main - Build # 65 - Still Unstable!
Posted by Apache Jenkins Server <je...@builds.apache.org>.
Build: https://ci-builds.apache.org/job/Solr/job/Solr-Check-main/65/
1 tests failed.
FAILED: org.apache.solr.client.solrj.io.stream.StreamDecoratorTest.testParallelPriorityStream
Error Message:
java.lang.AssertionError: expected:<5> but was:<4>
Stack Trace:
java.lang.AssertionError: expected:<5> but was:<4>
at __randomizedtesting.SeedInfo.seed([258F8211A6AA2991:15F433C299EA5736]:0)
at org.junit.Assert.fail(Assert.java:89)
at org.junit.Assert.failNotEquals(Assert.java:835)
at org.junit.Assert.assertEquals(Assert.java:647)
at org.junit.Assert.assertEquals(Assert.java:633)
at org.apache.solr.client.solrj.io.stream.StreamDecoratorTest.testParallelPriorityStream(StreamDecoratorTest.java:2648)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:566)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1754)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:942)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:978)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
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:44)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:45)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:819)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:470)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:951)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:836)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:887)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:898)
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:43)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:38)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.lambda$forkTimeoutingTask$0(ThreadLeakControl.java:826)
at java.base/java.lang.Thread.run(Thread.java:834)
Build Log:
[...truncated 7853 lines...]
ERROR: The following test(s) have failed:
- org.apache.solr.client.solrj.io.stream.StreamDecoratorTest.testParallelPriorityStream (:solr:solrj)
Test output: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/solrj/build/test-results/test/outputs/OUTPUT-org.apache.solr.client.solrj.io.stream.StreamDecoratorTest.txt
Reproduce with: gradlew :solr:solrj:test --tests "org.apache.solr.client.solrj.io.stream.StreamDecoratorTest.testParallelPriorityStream" -Ptests.jvms=4 -Ptests.haltonfailure=false -Ptests.jvmargs=-XX:TieredStopAtLevel=1 -Ptests.seed=258F8211A6AA2991 -Ptests.multiplier=2 -Ptests.badapples=false -Ptests.file.encoding=UTF-8
Deprecated Gradle features were used in this build, making it incompatible with Gradle 7.0.
Use '--warning-mode all' to show the individual deprecation warnings.
See https://docs.gradle.org/6.6.1/userguide/command_line_interface.html#sec:command_line_warnings
BUILD SUCCESSFUL in 49m 30s
296 actionable tasks: 296 executed
Build step 'Invoke Gradle script' changed build result to SUCCESS
Archiving artifacts
java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath$ValidateAntFileMask.hasMatch(FilePath.java:3066)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2945)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2926)
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3313)
Also: hudson.remoting.Channel$CallSiteStackTrace: Remote call to lucene2
at hudson.remoting.Channel.attachCallSiteStackTrace(Channel.java:1800)
at hudson.remoting.UserRequest$ExceptionResponse.retrieve(UserRequest.java:357)
at hudson.remoting.Channel.call(Channel.java:1001)
at hudson.FilePath.act(FilePath.java:1157)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
Caused: hudson.FilePath$TunneledInterruptedException
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3315)
at hudson.remoting.UserRequest.perform(UserRequest.java:211)
at hudson.remoting.UserRequest.perform(UserRequest.java:54)
at hudson.remoting.Request$2.run(Request.java:375)
at hudson.remoting.InterceptingExecutorService$1.call(InterceptingExecutorService.java:73)
at java.util.concurrent.FutureTask.run(FutureTask.java:266)
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
at java.lang.Thread.run(Thread.java:748)
Caused: java.lang.InterruptedException: java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath.act(FilePath.java:1159)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
No artifacts found that match the file pattern "**/*.events,heapdumps/**,**/hs_err_pid*". Configuration error?
Recording test results
[Checks API] No suitable checks publisher found.
Build step 'Publish JUnit test result report' changed build result to UNSTABLE
Email was triggered for: Unstable (Test Failures)
Sending email for trigger: Unstable (Test Failures)
[JENKINS] Solr » Solr-Check-main - Build # 64 - Still Unstable!
Posted by Apache Jenkins Server <je...@builds.apache.org>.
Build: https://ci-builds.apache.org/job/Solr/job/Solr-Check-main/64/
2 tests failed.
FAILED: org.apache.solr.cloud.TestSolrCloudWithDelegationTokens.testDelegationTokenRenew
Error Message:
java.lang.AssertionError: expected:<200> but was:<403>
Stack Trace:
java.lang.AssertionError: expected:<200> but was:<403>
at __randomizedtesting.SeedInfo.seed([53A5A2008BE3BA66:643E561EB32F67C2]:0)
at org.junit.Assert.fail(Assert.java:89)
at org.junit.Assert.failNotEquals(Assert.java:835)
at org.junit.Assert.assertEquals(Assert.java:647)
at org.junit.Assert.assertEquals(Assert.java:633)
at org.apache.solr.cloud.TestSolrCloudWithDelegationTokens.renewDelegationToken(TestSolrCloudWithDelegationTokens.java:138)
at org.apache.solr.cloud.TestSolrCloudWithDelegationTokens.verifyDelegationTokenRenew(TestSolrCloudWithDelegationTokens.java:349)
at org.apache.solr.cloud.TestSolrCloudWithDelegationTokens.testDelegationTokenRenew(TestSolrCloudWithDelegationTokens.java:367)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:566)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1754)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:942)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:978)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
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:44)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:45)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:819)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:470)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:951)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:836)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:887)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:898)
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:43)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:38)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.lambda$forkTimeoutingTask$0(ThreadLeakControl.java:826)
at java.base/java.lang.Thread.run(Thread.java:834)
FAILED: org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort
Error Message:
java.lang.IllegalStateException: unexpected docvalues type SORTED for field 'stringdv' (expected=BINARY). Re-index with correct docvalues type.
Stack Trace:
java.lang.IllegalStateException: unexpected docvalues type SORTED for field 'stringdv' (expected=BINARY). Re-index with correct docvalues type.
at __randomizedtesting.SeedInfo.seed([53A5A2008BE3BA66:DEFBEFD8DC0F6711]:0)
at org.apache.lucene.index.DocValues.checkField(DocValues.java:303)
at org.apache.lucene.index.DocValues.getBinary(DocValues.java:342)
at org.apache.lucene.search.FieldComparator$TermValComparator.getBinaryDocValues(FieldComparator.java:556)
at org.apache.lucene.search.FieldComparator$TermValComparator.getLeafComparator(FieldComparator.java:561)
at org.apache.lucene.search.FieldValueHitQueue.getComparators(FieldValueHitQueue.java:181)
at org.apache.lucene.search.TopFieldCollector$TopFieldLeafCollector.<init>(TopFieldCollector.java:64)
at org.apache.lucene.search.TopFieldCollector$SimpleFieldCollector$1.<init>(TopFieldCollector.java:196)
at org.apache.lucene.search.TopFieldCollector$SimpleFieldCollector.getLeafCollector(TopFieldCollector.java:196)
at org.apache.lucene.search.FilterCollector.getLeafCollector(FilterCollector.java:38)
at org.apache.lucene.search.AssertingCollector.getLeafCollector(AssertingCollector.java:45)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:737)
at org.apache.lucene.search.AssertingIndexSearcher.search(AssertingIndexSearcher.java:73)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:533)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:664)
at org.apache.lucene.search.IndexSearcher.searchAfter(IndexSearcher.java:645)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:548)
at org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringSort(TestFieldCacheSortRandom.java:174)
at org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort(TestFieldCacheSortRandom.java:70)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:566)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1754)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:942)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:978)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:44)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:45)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:819)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:470)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:951)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:836)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:887)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:898)
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:43)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:38)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.lambda$forkTimeoutingTask$0(ThreadLeakControl.java:826)
at java.base/java.lang.Thread.run(Thread.java:834)
Build Log:
[...truncated 1399 lines...]
ERROR: The following test(s) have failed:
- org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort (:solr:core)
Test output: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/test-results/test/outputs/OUTPUT-org.apache.solr.uninverting.TestFieldCacheSortRandom.txt
Reproduce with: gradlew :solr:core:test --tests "org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort" -Ptests.jvms=4 -Ptests.haltonfailure=false -Ptests.jvmargs=-XX:TieredStopAtLevel=1 -Ptests.seed=53A5A2008BE3BA66 -Ptests.multiplier=2 -Ptests.badapples=false -Ptests.file.encoding=US-ASCII
- org.apache.solr.cloud.TestSolrCloudWithDelegationTokens.testDelegationTokenRenew (:solr:core)
Test output: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/test-results/test/outputs/OUTPUT-org.apache.solr.cloud.TestSolrCloudWithDelegationTokens.txt
Reproduce with: gradlew :solr:core:test --tests "org.apache.solr.cloud.TestSolrCloudWithDelegationTokens.testDelegationTokenRenew" -Ptests.jvms=4 -Ptests.haltonfailure=false -Ptests.jvmargs=-XX:TieredStopAtLevel=1 -Ptests.seed=53A5A2008BE3BA66 -Ptests.multiplier=2 -Ptests.badapples=false -Ptests.file.encoding=US-ASCII
Deprecated Gradle features were used in this build, making it incompatible with Gradle 7.0.
Use '--warning-mode all' to show the individual deprecation warnings.
See https://docs.gradle.org/6.6.1/userguide/command_line_interface.html#sec:command_line_warnings
BUILD SUCCESSFUL in 49m 33s
296 actionable tasks: 296 executed
Build step 'Invoke Gradle script' changed build result to SUCCESS
Archiving artifacts
java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath$ValidateAntFileMask.hasMatch(FilePath.java:3066)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2945)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2926)
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3313)
Also: hudson.remoting.Channel$CallSiteStackTrace: Remote call to lucene1
at hudson.remoting.Channel.attachCallSiteStackTrace(Channel.java:1800)
at hudson.remoting.UserRequest$ExceptionResponse.retrieve(UserRequest.java:357)
at hudson.remoting.Channel.call(Channel.java:1001)
at hudson.FilePath.act(FilePath.java:1157)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
Caused: hudson.FilePath$TunneledInterruptedException
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3315)
at hudson.remoting.UserRequest.perform(UserRequest.java:211)
at hudson.remoting.UserRequest.perform(UserRequest.java:54)
at hudson.remoting.Request$2.run(Request.java:375)
at hudson.remoting.InterceptingExecutorService$1.call(InterceptingExecutorService.java:73)
at java.util.concurrent.FutureTask.run(FutureTask.java:266)
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
at java.lang.Thread.run(Thread.java:748)
Caused: java.lang.InterruptedException: java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath.act(FilePath.java:1159)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
No artifacts found that match the file pattern "**/*.events,heapdumps/**,**/hs_err_pid*". Configuration error?
Recording test results
[Checks API] No suitable checks publisher found.
Build step 'Publish JUnit test result report' changed build result to UNSTABLE
Email was triggered for: Unstable (Test Failures)
Sending email for trigger: Unstable (Test Failures)
[JENKINS] Solr » Solr-Check-main - Build # 63 - Still Unstable!
Posted by Apache Jenkins Server <je...@builds.apache.org>.
Build: https://ci-builds.apache.org/job/Solr/job/Solr-Check-main/63/
1 tests failed.
FAILED: org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort
Error Message:
java.lang.IllegalStateException: unexpected docvalues type SORTED for field 'stringdv' (expected=BINARY). Re-index with correct docvalues type.
Stack Trace:
java.lang.IllegalStateException: unexpected docvalues type SORTED for field 'stringdv' (expected=BINARY). Re-index with correct docvalues type.
at __randomizedtesting.SeedInfo.seed([7D026BCB0084CAC6:F05C2613576817B1]:0)
at org.apache.lucene.index.DocValues.checkField(DocValues.java:303)
at org.apache.lucene.index.DocValues.getBinary(DocValues.java:342)
at org.apache.lucene.search.FieldComparator$TermValComparator.getBinaryDocValues(FieldComparator.java:556)
at org.apache.lucene.search.FieldComparator$TermValComparator.getLeafComparator(FieldComparator.java:561)
at org.apache.lucene.search.FieldValueHitQueue.getComparators(FieldValueHitQueue.java:181)
at org.apache.lucene.search.TopFieldCollector$TopFieldLeafCollector.<init>(TopFieldCollector.java:64)
at org.apache.lucene.search.TopFieldCollector$SimpleFieldCollector$1.<init>(TopFieldCollector.java:196)
at org.apache.lucene.search.TopFieldCollector$SimpleFieldCollector.getLeafCollector(TopFieldCollector.java:196)
at org.apache.lucene.search.FilterCollector.getLeafCollector(FilterCollector.java:38)
at org.apache.lucene.search.AssertingCollector.getLeafCollector(AssertingCollector.java:45)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:737)
at org.apache.lucene.search.AssertingIndexSearcher.search(AssertingIndexSearcher.java:73)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:533)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:664)
at org.apache.lucene.search.IndexSearcher.searchAfter(IndexSearcher.java:645)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:548)
at org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringSort(TestFieldCacheSortRandom.java:174)
at org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort(TestFieldCacheSortRandom.java:70)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:566)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1754)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:942)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:978)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:44)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:45)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:819)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:470)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:951)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:836)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:887)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:898)
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:43)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:38)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.lambda$forkTimeoutingTask$0(ThreadLeakControl.java:826)
at java.base/java.lang.Thread.run(Thread.java:834)
Build Log:
[...truncated 855 lines...]
ERROR: The following test(s) have failed:
- org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort (:solr:core)
Test output: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/test-results/test/outputs/OUTPUT-org.apache.solr.uninverting.TestFieldCacheSortRandom.txt
Reproduce with: gradlew :solr:core:test --tests "org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort" -Ptests.jvms=4 -Ptests.haltonfailure=false -Ptests.jvmargs=-XX:TieredStopAtLevel=1 -Ptests.seed=7D026BCB0084CAC6 -Ptests.multiplier=2 -Ptests.badapples=false -Ptests.file.encoding=ISO-8859-1
Deprecated Gradle features were used in this build, making it incompatible with Gradle 7.0.
Use '--warning-mode all' to show the individual deprecation warnings.
See https://docs.gradle.org/6.6.1/userguide/command_line_interface.html#sec:command_line_warnings
BUILD SUCCESSFUL in 49m 47s
296 actionable tasks: 296 executed
Build step 'Invoke Gradle script' changed build result to SUCCESS
Archiving artifacts
java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath$ValidateAntFileMask.hasMatch(FilePath.java:3066)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2945)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2926)
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3313)
Also: hudson.remoting.Channel$CallSiteStackTrace: Remote call to lucene1
at hudson.remoting.Channel.attachCallSiteStackTrace(Channel.java:1800)
at hudson.remoting.UserRequest$ExceptionResponse.retrieve(UserRequest.java:357)
at hudson.remoting.Channel.call(Channel.java:1001)
at hudson.FilePath.act(FilePath.java:1157)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
Caused: hudson.FilePath$TunneledInterruptedException
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3315)
at hudson.remoting.UserRequest.perform(UserRequest.java:211)
at hudson.remoting.UserRequest.perform(UserRequest.java:54)
at hudson.remoting.Request$2.run(Request.java:375)
at hudson.remoting.InterceptingExecutorService$1.call(InterceptingExecutorService.java:73)
at java.util.concurrent.FutureTask.run(FutureTask.java:266)
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
at java.lang.Thread.run(Thread.java:748)
Caused: java.lang.InterruptedException: java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath.act(FilePath.java:1159)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
No artifacts found that match the file pattern "**/*.events,heapdumps/**,**/hs_err_pid*". Configuration error?
Recording test results
[Checks API] No suitable checks publisher found.
Build step 'Publish JUnit test result report' changed build result to UNSTABLE
Email was triggered for: Unstable (Test Failures)
Sending email for trigger: Unstable (Test Failures)
[JENKINS] Solr » Solr-Check-main - Build # 62 - Still Unstable!
Posted by Apache Jenkins Server <je...@builds.apache.org>.
Build: https://ci-builds.apache.org/job/Solr/job/Solr-Check-main/62/
1 tests failed.
FAILED: org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort
Error Message:
java.lang.IllegalStateException: unexpected docvalues type SORTED for field 'stringdv' (expected=BINARY). Re-index with correct docvalues type.
Stack Trace:
java.lang.IllegalStateException: unexpected docvalues type SORTED for field 'stringdv' (expected=BINARY). Re-index with correct docvalues type.
at __randomizedtesting.SeedInfo.seed([3AAE8E42D96F60DD:B7F0C39A8E83BDAA]:0)
at org.apache.lucene.index.DocValues.checkField(DocValues.java:303)
at org.apache.lucene.index.DocValues.getBinary(DocValues.java:342)
at org.apache.lucene.search.FieldComparator$TermValComparator.getBinaryDocValues(FieldComparator.java:556)
at org.apache.lucene.search.FieldComparator$TermValComparator.getLeafComparator(FieldComparator.java:561)
at org.apache.lucene.search.FieldValueHitQueue.getComparators(FieldValueHitQueue.java:181)
at org.apache.lucene.search.TopFieldCollector$TopFieldLeafCollector.<init>(TopFieldCollector.java:64)
at org.apache.lucene.search.TopFieldCollector$SimpleFieldCollector$1.<init>(TopFieldCollector.java:196)
at org.apache.lucene.search.TopFieldCollector$SimpleFieldCollector.getLeafCollector(TopFieldCollector.java:196)
at org.apache.lucene.search.FilterCollector.getLeafCollector(FilterCollector.java:38)
at org.apache.lucene.search.AssertingCollector.getLeafCollector(AssertingCollector.java:45)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:737)
at org.apache.lucene.search.AssertingIndexSearcher.search(AssertingIndexSearcher.java:73)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:533)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:664)
at org.apache.lucene.search.IndexSearcher.searchAfter(IndexSearcher.java:645)
at org.apache.lucene.search.IndexSearcher.search(IndexSearcher.java:548)
at org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringSort(TestFieldCacheSortRandom.java:174)
at org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort(TestFieldCacheSortRandom.java:70)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:566)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1754)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:942)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:978)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:44)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:45)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:819)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:470)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:951)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:836)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:887)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:898)
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:43)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:38)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:51)
at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:43)
at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:44)
at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:60)
at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.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:370)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.lambda$forkTimeoutingTask$0(ThreadLeakControl.java:826)
at java.base/java.lang.Thread.run(Thread.java:834)
Build Log:
[...truncated 860 lines...]
ERROR: The following test(s) have failed:
- org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort (:solr:core)
Test output: /home/jenkins/jenkins-slave/workspace/Solr/Solr-Check-main/solr/core/build/test-results/test/outputs/OUTPUT-org.apache.solr.uninverting.TestFieldCacheSortRandom.txt
Reproduce with: gradlew :solr:core:test --tests "org.apache.solr.uninverting.TestFieldCacheSortRandom.testRandomStringValSort" -Ptests.jvms=4 -Ptests.haltonfailure=false -Ptests.jvmargs=-XX:TieredStopAtLevel=1 -Ptests.seed=3AAE8E42D96F60DD -Ptests.multiplier=2 -Ptests.badapples=false -Ptests.file.encoding=US-ASCII
Deprecated Gradle features were used in this build, making it incompatible with Gradle 7.0.
Use '--warning-mode all' to show the individual deprecation warnings.
See https://docs.gradle.org/6.6.1/userguide/command_line_interface.html#sec:command_line_warnings
BUILD SUCCESSFUL in 50m 29s
296 actionable tasks: 296 executed
Build step 'Invoke Gradle script' changed build result to SUCCESS
Archiving artifacts
java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath$ValidateAntFileMask.hasMatch(FilePath.java:3066)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2945)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2926)
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3313)
Also: hudson.remoting.Channel$CallSiteStackTrace: Remote call to lucene1
at hudson.remoting.Channel.attachCallSiteStackTrace(Channel.java:1800)
at hudson.remoting.UserRequest$ExceptionResponse.retrieve(UserRequest.java:357)
at hudson.remoting.Channel.call(Channel.java:1001)
at hudson.FilePath.act(FilePath.java:1157)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
Caused: hudson.FilePath$TunneledInterruptedException
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3315)
at hudson.remoting.UserRequest.perform(UserRequest.java:211)
at hudson.remoting.UserRequest.perform(UserRequest.java:54)
at hudson.remoting.Request$2.run(Request.java:375)
at hudson.remoting.InterceptingExecutorService$1.call(InterceptingExecutorService.java:73)
at java.util.concurrent.FutureTask.run(FutureTask.java:266)
at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
at java.lang.Thread.run(Thread.java:748)
Caused: java.lang.InterruptedException: java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath.act(FilePath.java:1159)
at hudson.FilePath.act(FilePath.java:1146)
at hudson.FilePath.validateAntFileMask(FilePath.java:2924)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:270)
at hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:80)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:804)
at hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:753)
at hudson.model.Build$BuildExecution.post2(Build.java:177)
at hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:698)
at hudson.model.Run.execute(Run.java:1932)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
No artifacts found that match the file pattern "**/*.events,heapdumps/**,**/hs_err_pid*". Configuration error?
Recording test results
[Checks API] No suitable checks publisher found.
Build step 'Publish JUnit test result report' changed build result to UNSTABLE
Email was triggered for: Unstable (Test Failures)
Sending email for trigger: Unstable (Test Failures)