Build:
https://builds.apache.org/job/Lucene-Solr-BadApples-NightlyTests-master/117/
1 tests failed.
FAILED: org.apache.solr.cloud.SharedFSAutoReplicaFailoverTest.test
Error Message:
Expected numSlices=2 numReplicas=2 but found
DocCollection(solrj_collection/13)={ "pullReplicas":"0",
"replicationFactor":"2", "shards":{ "shard1":{
"range":"80000000-ffffffff", "state":"active", "replicas":{
"core_node3":{
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node3/data/",
"base_url":"http://127.0.0.1:41437/p_/n",
"node_name":"127.0.0.1:41437_p_%2Fn", "type":"NRT",
"force_set_state":"false",
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node3/data/tlog",
"core":"solrj_collection_shard1_replica_n1",
"shared_storage":"true", "state":"active",
"leader":"true"}, "core_node5":{
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node5/data/",
"base_url":"http://127.0.0.1:37079/p_/n",
"node_name":"127.0.0.1:37079_p_%2Fn", "type":"NRT",
"force_set_state":"false",
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node5/data/tlog",
"core":"solrj_collection_shard1_replica_n2",
"shared_storage":"true", "state":"active"}}}, "shard2":{
"range":"0-7fffffff", "state":"active", "replicas":{
"core_node7":{
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node7/data/",
"base_url":"http://127.0.0.1:39339/p_/n",
"node_name":"127.0.0.1:39339_p_%2Fn", "type":"NRT",
"force_set_state":"false",
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node7/data/tlog",
"core":"solrj_collection_shard2_replica_n4",
"shared_storage":"true", "state":"active",
"leader":"true"}, "core_node8":{
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node8/data/",
"base_url":"http://127.0.0.1:39615/p_/n",
"node_name":"127.0.0.1:39615_p_%2Fn", "type":"NRT",
"force_set_state":"false",
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node8/data/tlog",
"core":"solrj_collection_shard2_replica_n6",
"shared_storage":"true", "state":"down"}}}}, "router":{
"field":"myOwnField", "name":"compositeId"}, "maxShardsPerNode":"2",
"autoAddReplicas":"true", "nrtReplicas":"2", "tlogReplicas":"0"} with
/live_nodes: [127.0.0.1:37079_p_%2Fn, 127.0.0.1:39339_p_%2Fn,
127.0.0.1:41437_p_%2Fn]
Stack Trace:
java.lang.AssertionError: Expected numSlices=2 numReplicas=2 but found
DocCollection(solrj_collection/13)={
"pullReplicas":"0",
"replicationFactor":"2",
"shards":{
"shard1":{
"range":"80000000-ffffffff",
"state":"active",
"replicas":{
"core_node3":{
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node3/data/",
"base_url":"http://127.0.0.1:41437/p_/n",
"node_name":"127.0.0.1:41437_p_%2Fn",
"type":"NRT",
"force_set_state":"false",
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node3/data/tlog",
"core":"solrj_collection_shard1_replica_n1",
"shared_storage":"true",
"state":"active",
"leader":"true"},
"core_node5":{
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node5/data/",
"base_url":"http://127.0.0.1:37079/p_/n",
"node_name":"127.0.0.1:37079_p_%2Fn",
"type":"NRT",
"force_set_state":"false",
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node5/data/tlog",
"core":"solrj_collection_shard1_replica_n2",
"shared_storage":"true",
"state":"active"}}},
"shard2":{
"range":"0-7fffffff",
"state":"active",
"replicas":{
"core_node7":{
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node7/data/",
"base_url":"http://127.0.0.1:39339/p_/n",
"node_name":"127.0.0.1:39339_p_%2Fn",
"type":"NRT",
"force_set_state":"false",
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node7/data/tlog",
"core":"solrj_collection_shard2_replica_n4",
"shared_storage":"true",
"state":"active",
"leader":"true"},
"core_node8":{
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node8/data/",
"base_url":"http://127.0.0.1:39615/p_/n",
"node_name":"127.0.0.1:39615_p_%2Fn",
"type":"NRT",
"force_set_state":"false",
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node8/data/tlog",
"core":"solrj_collection_shard2_replica_n6",
"shared_storage":"true",
"state":"down"}}}},
"router":{
"field":"myOwnField",
"name":"compositeId"},
"maxShardsPerNode":"2",
"autoAddReplicas":"true",
"nrtReplicas":"2",
"tlogReplicas":"0"} with /live_nodes: [127.0.0.1:37079_p_%2Fn,
127.0.0.1:39339_p_%2Fn, 127.0.0.1:41437_p_%2Fn]
at
__randomizedtesting.SeedInfo.seed([801C4F434C624FB0:8487099E29E2248]:0)
at org.junit.Assert.fail(Assert.java:88)
at
org.apache.solr.cloud.SharedFSAutoReplicaFailoverTest.assertSliceAndReplicaCount(SharedFSAutoReplicaFailoverTest.java:415)
at
org.apache.solr.cloud.SharedFSAutoReplicaFailoverTest.testBasics(SharedFSAutoReplicaFailoverTest.java:222)
at
org.apache.solr.cloud.SharedFSAutoReplicaFailoverTest.test(SharedFSAutoReplicaFailoverTest.java:145)
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:1090)
at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1061)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java: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.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java: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 12735 lines...]
[junit4] Suite: org.apache.solr.cloud.SharedFSAutoReplicaFailoverTest
[junit4] 2> 518917 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.s.SolrTestCase Setting 'solr.default.confdir' system property to
test-framework derived value of
'/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/server/solr/configsets/_default/conf'
[junit4] 2> 518917 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.s.SolrTestCaseJ4 SecureRandom sanity checks:
test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
[junit4] 2> 518919 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.s.SolrTestCaseJ4 Created dataDir:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/data-dir-34-001
[junit4] 2> 518919 WARN
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=1 numCloses=1
[junit4] 2> 518919 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true)
w/NUMERIC_DOCVALUES_SYSPROP=false
[junit4] 2> 518920 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (false) via:
@org.apache.solr.SolrTestCaseJ4$SuppressSSL(bugUrl="None")
[junit4] 2> 518920 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.s.BaseDistributedSearchTestCase Setting hostContext system property: /p_/n
[junit4] 1> Formatting using clusterid: testClusterID
[junit4] 2> 518974 WARN
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.h.h.HttpRequestLog Jetty request log can only be enabled using Log4j
[junit4] 2> 518976 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 11.0.4+10-LTS
[junit4] 2> 518977 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 518977 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 518977 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session node0 Scavenging every 660000ms
[junit4] 2> 518978 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@146401d3{static,/static,jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/static,AVAILABLE}
[junit4] 2> 519135 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.w.WebAppContext@31c9e0e6{hdfs,/,file:///home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/jetty-lucene2-us-west_apache_org-45923-hadoop-hdfs-3_2_0-tests_jar-_-any-18359594215488554940.dir/webapp/,AVAILABLE}{jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/hdfs}
[junit4] 2> 519136 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@28ce30a3{HTTP/1.1,
(http/1.1)}{lucene2-us-west.apache.org:45923}
[junit4] 2> 519136 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.Server Started @519186ms
[junit4] 2> 519177 WARN
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.h.h.HttpRequestLog Jetty request log can only be enabled using Log4j
[junit4] 2> 519179 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 11.0.4+10-LTS
[junit4] 2> 519180 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 519180 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 519180 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session node0 Scavenging every 600000ms
[junit4] 2> 519180 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@467b9573{static,/static,jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/static,AVAILABLE}
[junit4] 2> 519313 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.w.WebAppContext@151b3feb{datanode,/,file:///home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/jetty-localhost-34222-hadoop-hdfs-3_2_0-tests_jar-_-any-3390089078469835044.dir/webapp/,AVAILABLE}{jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/datanode}
[junit4] 2> 519313 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@6d598862{HTTP/1.1,
(http/1.1)}{localhost:34222}
[junit4] 2> 519313 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.Server Started @519363ms
[junit4] 2> 519338 WARN
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.h.h.HttpRequestLog Jetty request log can only be enabled using Log4j
[junit4] 2> 519339 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 11.0.4+10-LTS
[junit4] 2> 519340 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 519340 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 519340 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session node0 Scavenging every 600000ms
[junit4] 2> 519340 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@50b28ad7{static,/static,jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/static,AVAILABLE}
[junit4] 2> 519406 INFO (Block report processor) [ ] BlockStateChange
BLOCK* processReport 0x3f03fc81a0bfc221: Processing first storage report for
DS-61ad6ca9-ae65-43f6-a920-8d026552ef1e from datanode
f044cb6d-5d84-4278-a2f2-7ef7ba69fe9a
[junit4] 2> 519406 INFO (Block report processor) [ ] BlockStateChange
BLOCK* processReport 0x3f03fc81a0bfc221: from storage
DS-61ad6ca9-ae65-43f6-a920-8d026552ef1e node
DatanodeRegistration(127.0.0.1:43751,
datanodeUuid=f044cb6d-5d84-4278-a2f2-7ef7ba69fe9a, infoPort=33074,
infoSecurePort=0, ipcPort=39789,
storageInfo=lv=-57;cid=testClusterID;nsid=919611731;c=1591989916638), blocks:
0, hasStaleStorage: true, processing time: 1 msecs, invalidatedBlocks: 0
[junit4] 2> 519406 INFO (Block report processor) [ ] BlockStateChange
BLOCK* processReport 0x3f03fc81a0bfc221: Processing first storage report for
DS-79d09595-2732-437b-9fbd-d5fe0e50407b from datanode
f044cb6d-5d84-4278-a2f2-7ef7ba69fe9a
[junit4] 2> 519406 INFO (Block report processor) [ ] BlockStateChange
BLOCK* processReport 0x3f03fc81a0bfc221: from storage
DS-79d09595-2732-437b-9fbd-d5fe0e50407b node
DatanodeRegistration(127.0.0.1:43751,
datanodeUuid=f044cb6d-5d84-4278-a2f2-7ef7ba69fe9a, infoPort=33074,
infoSecurePort=0, ipcPort=39789,
storageInfo=lv=-57;cid=testClusterID;nsid=919611731;c=1591989916638), blocks:
0, hasStaleStorage: false, processing time: 0 msecs, invalidatedBlocks: 0
[junit4] 2> 519478 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.w.WebAppContext@10846d54{datanode,/,file:///home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/jetty-localhost-41204-hadoop-hdfs-3_2_0-tests_jar-_-any-1514345408930559820.dir/webapp/,AVAILABLE}{jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/datanode}
[junit4] 2> 519478 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@157710f0{HTTP/1.1,
(http/1.1)}{localhost:41204}
[junit4] 2> 519478 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.Server Started @519528ms
[junit4] 2> 519569 INFO (Block report processor) [ ] BlockStateChange
BLOCK* processReport 0x1b3f63ce754abcae: Processing first storage report for
DS-a39237fc-8bf6-4005-ab42-5c68b42d526e from datanode
f382350e-c34b-47af-ad4e-1c89e3e3ac6d
[junit4] 2> 519569 INFO (Block report processor) [ ] BlockStateChange
BLOCK* processReport 0x1b3f63ce754abcae: from storage
DS-a39237fc-8bf6-4005-ab42-5c68b42d526e node
DatanodeRegistration(127.0.0.1:35773,
datanodeUuid=f382350e-c34b-47af-ad4e-1c89e3e3ac6d, infoPort=42250,
infoSecurePort=0, ipcPort=33469,
storageInfo=lv=-57;cid=testClusterID;nsid=919611731;c=1591989916638), blocks:
0, hasStaleStorage: true, processing time: 0 msecs, invalidatedBlocks: 0
[junit4] 2> 519569 INFO (Block report processor) [ ] BlockStateChange
BLOCK* processReport 0x1b3f63ce754abcae: Processing first storage report for
DS-33822373-403d-478f-ba2c-762ab1b022d7 from datanode
f382350e-c34b-47af-ad4e-1c89e3e3ac6d
[junit4] 2> 519569 INFO (Block report processor) [ ] BlockStateChange
BLOCK* processReport 0x1b3f63ce754abcae: from storage
DS-33822373-403d-478f-ba2c-762ab1b022d7 node
DatanodeRegistration(127.0.0.1:35773,
datanodeUuid=f382350e-c34b-47af-ad4e-1c89e3e3ac6d, infoPort=42250,
infoSecurePort=0, ipcPort=33469,
storageInfo=lv=-57;cid=testClusterID;nsid=919611731;c=1591989916638), blocks:
0, hasStaleStorage: false, processing time: 0 msecs, invalidatedBlocks: 0
[junit4] 2> 519710 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 519710 INFO (ZkTestServer Run Thread) [ ]
o.a.s.c.ZkTestServer client port: 0.0.0.0/0.0.0.0:0
[junit4] 2> 519710 INFO (ZkTestServer Run Thread) [ ]
o.a.s.c.ZkTestServer Starting server
[junit4] 2> 519810 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer start zk server on port: 42143
[junit4] 2> 519811 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer waitForServerUp: 127.0.0.1:42143
[junit4] 2> 519811 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:42143
[junit4] 2> 519811 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer connecting to 127.0.0.1 42143
[junit4] 2> 519813 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 519816 INFO (zkConnectionManagerCallback-3811-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 519816 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 519821 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 519822 INFO (zkConnectionManagerCallback-3813-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 519822 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 519824 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/solrconfig-tlog.xml
to /configs/conf1/solrconfig.xml
[junit4] 2> 519826 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/schema15.xml
to /configs/conf1/schema.xml
[junit4] 2> 519828 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/solrconfig.snippet.randomindexconfig.xml
to /configs/conf1/solrconfig.snippet.randomindexconfig.xml
[junit4] 2> 519829 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/stopwords.txt
to /configs/conf1/stopwords.txt
[junit4] 2> 519830 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/protwords.txt
to /configs/conf1/protwords.txt
[junit4] 2> 519832 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/currency.xml
to /configs/conf1/currency.xml
[junit4] 2> 519833 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/enumsConfig.xml
to /configs/conf1/enumsConfig.xml
[junit4] 2> 519835 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/open-exchange-rates.json
to /configs/conf1/open-exchange-rates.json
[junit4] 2> 519836 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/mapping-ISOLatin1Accent.txt
to /configs/conf1/mapping-ISOLatin1Accent.txt
[junit4] 2> 519837 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/old_synonyms.txt
to /configs/conf1/old_synonyms.txt
[junit4] 2> 519839 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkTestServer put
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/core/src/test-files/solr/collection1/conf/synonyms.txt
to /configs/conf1/synonyms.txt
[junit4] 2> 519840 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase Will use NRT replicas unless explicitly
asked otherwise
[junit4] 2> 519982 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 519982 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 519982 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 11.0.4+10-LTS
[junit4] 2> 519984 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 519984 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 519984 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.s.session node0 Scavenging every 600000ms
[junit4] 2> 519984 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@17fcd28e{/p_/n,null,AVAILABLE}
[junit4] 2> 519985 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@54922214{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:39339}
[junit4] 2> 519985 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.s.Server Started @520035ms
[junit4] 2> 519985 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/p_/n,
hostPort=39339,
coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/../../../../../../../../../../../home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/control-001/cores}
[junit4] 2> 519985 ERROR
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 519985 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 519985 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
9.0.0
[junit4] 2> 519985 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 519985 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr
[junit4] 2> 519985 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-06-12T19:25:17.674847Z
[junit4] 2> 519986 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 519988 INFO (zkConnectionManagerCallback-3815-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 519988 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 520090 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 520090 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/../../../../../../../../../../../home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/control-001/solr.xml
[junit4] 2> 520096 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.SolrXmlConfig MBean server found:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1, but no JMX reporters were
configured - adding default JMX reporter.
[junit4] 2> 521283 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
[junit4] 2> 521285 WARN
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@718da2c8[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 521285 WARN
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@718da2c8[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 521288 WARN
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@478a8a14[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 521288 WARN
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@478a8a14[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 521290 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42143/solr
[junit4] 2> 521291 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 521293 INFO (zkConnectionManagerCallback-3826-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 521293 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 521396 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.c.ConnectionManager Waiting for client
to connect to ZooKeeper
[junit4] 2> 521398 INFO (zkConnectionManagerCallback-3828-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 521398 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.c.ConnectionManager Client is connected
to ZooKeeper
[junit4] 2> 521495 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.OverseerElectionContext I am going to
be the leader 127.0.0.1:39339_p_%2Fn
[junit4] 2> 521496 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.Overseer Overseer
(id=72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000) starting
[junit4] 2> 521503 INFO
(OverseerStateUpdate-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.Overseer Starting to work on the main
queue : 127.0.0.1:39339_p_%2Fn
[junit4] 2> 521503 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:39339_p_%2Fn
[junit4] 2> 521504 DEBUG
(OverseerAutoScalingTriggerThread-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Adding .auto_add_replicas and
.scheduled_maintenance triggers
[junit4] 2> 521505 DEBUG
(OverseerAutoScalingTriggerThread-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Refreshing /autoscaling.json with
znode version 1
[junit4] 2> 521505 DEBUG
(OverseerAutoScalingTriggerThread-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Current znodeVersion 1,
lastZnodeVersion 0
[junit4] 2> 521505 DEBUG
(OverseerAutoScalingTriggerThread-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Processed trigger updates upto
znodeVersion 1
[junit4] 2> 521506 INFO (zkCallback-3827-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 521513 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.p.PackageLoader /packages.json updated to
version -1
[junit4] 2> 521514 WARN
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.CoreContainer Not all security plugins
configured! authentication=disabled authorization=disabled. Solr is only as
secure as you make it. Consider configuring authentication/authorization before
exposing Solr to users internal or external. See
https://s.apache.org/solrsecurity for more info
[junit4] 2> 521515 DEBUG
(OverseerAutoScalingTriggerThread-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: [127.0.0.1:39339_p_%2Fn]
[junit4] 2> 521516 DEBUG
(OverseerAutoScalingTriggerThread-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread -- deactivating old nodeLost /
nodeAdded markers
[junit4] 2> 521516 DEBUG
(OverseerAutoScalingTriggerThread-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Current znodeVersion 1,
lastZnodeVersion 1
[junit4] 2> 521516 DEBUG (ScheduledTrigger-3833-thread-1) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 1 and last live nodes: 1
[junit4] 2> 521530 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.h.a.MetricsHistoryHandler No .system
collection, keeping metrics history in memory.
[junit4] 2> 521558 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1
[junit4] 2> 521571 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1
[junit4] 2> 521572 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1
[junit4] 2> 521573 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0])
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/control-001/cores
[junit4] 2> 521584 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 521586 INFO (zkConnectionManagerCallback-3845-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 521586 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 521588 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 521590 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:42143/solr ready
[junit4] 2> 521592 INFO (qtp1772783541-10756) [n:127.0.0.1:39339_p_%2Fn
] o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params
collection.configName=conf1&name=control_collection&nrtReplicas=1&action=CREATE&numShards=1&createNodeSet=127.0.0.1:39339_p_%252Fn&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 521597 INFO
(OverseerThreadFactory-3835-thread-1-processing-n:127.0.0.1:39339_p_%2Fn)
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.a.c.CreateCollectionCmd Create
collection control_collection
[junit4] 2> 521707 INFO (qtp1772783541-10755) [n:127.0.0.1:39339_p_%2Fn
] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4
transient cores
[junit4] 2> 521707 INFO (qtp1772783541-10755) [n:127.0.0.1:39339_p_%2Fn
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores&wt=javabin&version=2&group=solr.node}
status=0 QTime=1
[junit4] 2> 521713 INFO
(OverseerStateUpdate-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.o.SliceMutator createReplica() {
[junit4] 2> "operation":"ADDREPLICA",
[junit4] 2> "collection":"control_collection",
[junit4] 2> "shard":"shard1",
[junit4] 2> "core":"control_collection_shard1_replica_n1",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:39339/p_/n",
[junit4] 2> "node_name":"127.0.0.1:39339_p_%2Fn",
[junit4] 2> "type":"NRT",
[junit4] 2> "waitForFinalState":"false"}
[junit4] 2> 521917 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 521929 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 521950 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.s.IndexSchema Schema name=test
[junit4] 2> 522084 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.s.IndexSchema Loaded schema
test/1.6 with uniqueid field id
[junit4] 2> 522109 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 522109 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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@430190b1
[junit4] 2> 522119 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory
solr.hdfs.home=hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home
[junit4] 2> 522119 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory Solr
Kerberos Authentication disabled
[junit4] 2> 522122 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/control-001/cores/control_collection_shard1_replica_n1],
dataDir=[hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/control_collection/core_node2/data/]
[junit4] 2> 522124 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory creating
directory factory for path
hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/control_collection/core_node2/data/snapshot_metadata
[junit4] 2> 522138 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory Number of
slabs of block cache [1] with direct memory allocation set to [true]
[junit4] 2> 522138 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory Block
cache target memory usage, slab size of [33554432] will allocate [1] slabs and
use ~[33554432] bytes
[junit4] 2> 522138 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory Creating
new global HDFS BlockCache
[junit4] 2> 522199 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.s.b.BlockDirectory Block cache
on write is disabled
[junit4] 2> 522205 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory creating
directory factory for path
hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/control_collection/core_node2/data
[junit4] 2> 522235 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory creating
directory factory for path
hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/control_collection/core_node2/data/index
[junit4] 2> 522245 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory Number of
slabs of block cache [1] with direct memory allocation set to [true]
[junit4] 2> 522245 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.HdfsDirectoryFactory Block
cache target memory usage, slab size of [33554432] will allocate [1] slabs and
use ~[33554432] bytes
[junit4] 2> 522251 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.s.b.BlockDirectory Block cache
on write is disabled
[junit4] 2> 522252 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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.TieredMergePolicy:
[TieredMergePolicy: maxMergeAtOnce=45, maxMergeAtOnceExplicit=29,
maxMergedSegmentMB=45.0927734375, floorSegmentMB=1.2919921875,
forceMergeDeletesPctAllowed=28.73308097744326, segmentsPerTier=18.0,
maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.8665021113608181,
deletesPctAllowed=22.93783799094757
[junit4] 2> 522518 DEBUG (ScheduledTrigger-3833-thread-3) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 1 and last live nodes: 1
[junit4] 2> 522823 WARN (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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}}}
[junit4] 2> 522901 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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.HdfsUpdateLog
[junit4] 2> 522901 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 522901 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.u.HdfsUpdateLog Initializing
HdfsUpdateLog: tlogDfsReplication=2
[junit4] 2> 522920 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.u.CommitTracker Hard AutoCommit:
disabled
[junit4] 2> 522920 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.u.CommitTracker Soft AutoCommit:
disabled
[junit4] 2> 522924 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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.TieredMergePolicy:
[TieredMergePolicy: maxMergeAtOnce=14, maxMergeAtOnceExplicit=43,
maxMergedSegmentMB=0.515625, floorSegmentMB=0.8818359375,
forceMergeDeletesPctAllowed=26.251593781776222, segmentsPerTier=20.0,
maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.0,
deletesPctAllowed=39.350179946169554
[junit4] 2> 523002 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 523003 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 523005 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 523007 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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 1669322423083728896
[junit4] 2> 523011 INFO
(searcherExecutor-3847-thread-1-processing-n:127.0.0.1:39339_p_%2Fn
x:control_collection_shard1_replica_n1 c:control_collection s:shard1
r:core_node2) [n:127.0.0.1:39339_p_%2Fn 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
[junit4] 2> 523014 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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}
[junit4] 2> 523014 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 523018 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext
Enough replicas found to continue.
[junit4] 2> 523018 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 523018 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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:39339/p_/n/control_collection_shard1_replica_n1/
[junit4] 2> 523018 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 523019 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
c:control_collection s:shard1 r:core_node2
x:control_collection_shard1_replica_n1 ] o.a.s.c.SyncStrategy
http://127.0.0.1:39339/p_/n/control_collection_shard1_replica_n1/ has no
replicas
[junit4] 2> 523019 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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/72959726764818436-core_node2-n_0000000000
[junit4] 2> 523021 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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:39339/p_/n/control_collection_shard1_replica_n1/ shard1
[junit4] 2> 523123 INFO (zkCallback-3827-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])
[junit4] 2> 523124 INFO (zkCallback-3827-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])
[junit4] 2> 523124 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
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
[junit4] 2> 523127 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
] 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=1211
[junit4] 2> 523130 INFO (qtp1772783541-10756) [n:127.0.0.1:39339_p_%2Fn
] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at
most 45 seconds. Check all shard replicas
[junit4] 2> 523227 INFO (zkCallback-3827-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])
[junit4] 2> 523227 INFO (zkCallback-3827-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])
[junit4] 2> 523227 INFO (zkCallback-3827-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])
[junit4] 2> 523228 INFO (qtp1772783541-10756) [n:127.0.0.1:39339_p_%2Fn
] 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:39339_p_%252Fn&wt=javabin&version=2}
status=0 QTime=1636
[junit4] 2> 523229 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase Waiting to see 1 active replicas in
collection: control_collection
[junit4] 2> 523335 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 523336 INFO (zkConnectionManagerCallback-3856-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 523336 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 523338 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 523339 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:42143/solr ready
[junit4] 2> 523339 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.ChaosMonkey monkey: init - expire sessions:false cause connection
loss:false
[junit4] 2> 523340 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
] o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params
collection.configName=conf1&name=collection1&nrtReplicas=1&action=CREATE&numShards=2&createNodeSet=&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 523344 INFO
(OverseerThreadFactory-3835-thread-2-processing-n:127.0.0.1:39339_p_%2Fn)
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.a.c.CreateCollectionCmd Create
collection collection1
[junit4] 2> 523344 INFO
(OverseerCollectionConfigSetProcessor-72959726764818436-127.0.0.1:39339_p_%2Fn-n_0000000000)
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.OverseerTaskQueue Response ZK path:
/overseer/collection-queue-work/qnr-0000000000 doesn't exist. Requestor may
have disconnected from ZooKeeper
[junit4] 2> 523518 DEBUG (ScheduledTrigger-3833-thread-4) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 1 and last live nodes: 1
[junit4] 2> 523549 WARN
(OverseerThreadFactory-3835-thread-2-processing-n:127.0.0.1:39339_p_%2Fn)
[n:127.0.0.1:39339_p_%2Fn ] o.a.s.c.a.c.CreateCollectionCmd It is unusual
to create a collection (collection1) without cores.
[junit4] 2> 523551 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at
most 45 seconds. Check all shard replicas
[junit4] 2> 523552 INFO (qtp1772783541-10757) [n:127.0.0.1:39339_p_%2Fn
] 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=211
[junit4] 2> 523553 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
[junit4] 2> 523553 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
[junit4] 2> 523554 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
[junit4] 2> 523554 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
[junit4] 2> 523554 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.SolrCloudTestCase active slice count: 2 expected: 2
[junit4] 2> 523554 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.SolrCloudTestCase active replica count: 0 expected replica count: 0
[junit4] 2> 523554 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase Creating jetty instances
pullReplicaCount=0 numOtherReplicas=4
[junit4] 2> 523701 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 1 in directory
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-1-001
of type NRT for shard2
[junit4] 2> 523702 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 523703 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 523703 INFO (closeThreadPool-3857-thread-1) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 11.0.4+10-LTS
[junit4] 2> 523704 INFO (closeThreadPool-3857-thread-1) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 523704 INFO (closeThreadPool-3857-thread-1) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 523704 INFO (closeThreadPool-3857-thread-1) [ ]
o.e.j.s.session node0 Scavenging every 600000ms
[junit4] 2> 523704 INFO (closeThreadPool-3857-thread-1) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@4a362af5{/p_/n,null,AVAILABLE}
[junit4] 2> 523705 INFO (closeThreadPool-3857-thread-1) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@786ab251{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:39615}
[junit4] 2> 523705 INFO (closeThreadPool-3857-thread-1) [ ]
o.e.j.s.Server Started @523755ms
[junit4] 2> 523705 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/p_/n,
solrconfig=solrconfig.xml, hostPort=39615,
coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-1-001/cores,
replicaType=NRT}
[junit4] 2> 523705 ERROR (closeThreadPool-3857-thread-1) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 523705 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 523705 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
9.0.0
[junit4] 2> 523705 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 523705 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr
[junit4] 2> 523705 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-06-12T19:25:21.394965Z
[junit4] 2> 523707 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 523711 INFO (zkConnectionManagerCallback-3859-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 523711 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 523813 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 523813 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-1-001/solr.xml
[junit4] 2> 523818 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.SolrXmlConfig MBean server found:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1, but no JMX reporters were
configured - adding default JMX reporter.
[junit4] 2> 523847 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 2 in directory
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-2-001
of type NRT for shard1
[junit4] 2> 523848 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 523848 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 523848 INFO (closeThreadPool-3857-thread-2) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 11.0.4+10-LTS
[junit4] 2> 523849 INFO (closeThreadPool-3857-thread-2) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 523849 INFO (closeThreadPool-3857-thread-2) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 523849 INFO (closeThreadPool-3857-thread-2) [ ]
o.e.j.s.session node0 Scavenging every 660000ms
[junit4] 2> 523850 INFO (closeThreadPool-3857-thread-2) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@1ec1fe4b{/p_/n,null,AVAILABLE}
[junit4] 2> 523850 INFO (closeThreadPool-3857-thread-2) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@a1e655f{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:37079}
[junit4] 2> 523850 INFO (closeThreadPool-3857-thread-2) [ ]
o.e.j.s.Server Started @523900ms
[junit4] 2> 523850 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/p_/n,
solrconfig=solrconfig.xml, hostPort=37079,
coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-2-001/cores,
replicaType=NRT}
[junit4] 2> 523851 ERROR (closeThreadPool-3857-thread-2) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 523851 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 523851 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
9.0.0
[junit4] 2> 523851 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 523851 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr
[junit4] 2> 523851 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-06-12T19:25:21.540208Z
[junit4] 2> 523852 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 523853 INFO (zkConnectionManagerCallback-3864-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 523854 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 523955 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 523955 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-2-001/solr.xml
[junit4] 2> 523983 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.SolrXmlConfig MBean server found:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1, but no JMX reporters were
configured - adding default JMX reporter.
[junit4] 2> 524019 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 3 in directory
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-3-001
of type NRT for shard2
[junit4] 2> 524020 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 524020 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 524020 INFO (closeThreadPool-3857-thread-3) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 11.0.4+10-LTS
[junit4] 2> 524022 INFO (closeThreadPool-3857-thread-3) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 524022 INFO (closeThreadPool-3857-thread-3) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 524022 INFO (closeThreadPool-3857-thread-3) [ ]
o.e.j.s.session node0 Scavenging every 600000ms
[junit4] 2> 524022 INFO (closeThreadPool-3857-thread-3) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@291754e{/p_/n,null,AVAILABLE}
[junit4] 2> 524023 INFO (closeThreadPool-3857-thread-3) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@3de82396{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:35875}
[junit4] 2> 524023 INFO (closeThreadPool-3857-thread-3) [ ]
o.e.j.s.Server Started @524073ms
[junit4] 2> 524023 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/p_/n,
solrconfig=solrconfig.xml, hostPort=35875,
coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-3-001/cores,
replicaType=NRT}
[junit4] 2> 524023 ERROR (closeThreadPool-3857-thread-3) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 524023 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 524023 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
9.0.0
[junit4] 2> 524023 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 524023 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr
[junit4] 2> 524023 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-06-12T19:25:21.712731Z
[junit4] 2> 524025 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 524026 INFO (zkConnectionManagerCallback-3869-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 524026 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 524129 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 524129 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-3-001/solr.xml
[junit4] 2> 524134 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.SolrXmlConfig MBean server found:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1, but no JMX reporters were
configured - adding default JMX reporter.
[junit4] 2> 524169 INFO
(TEST-SharedFSAutoReplicaFailoverTest.test-seed#[801C4F434C624FB0]) [ ]
o.a.s.c.AbstractFullDistribZkTestBase create jetty 4 in directory
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-4-001
of type NRT for shard1
[junit4] 2> 524170 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 524170 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 524170 INFO (closeThreadPool-3857-thread-4) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 11.0.4+10-LTS
[junit4] 2> 524171 INFO (closeThreadPool-3857-thread-4) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 524172 INFO (closeThreadPool-3857-thread-4) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 524172 INFO (closeThreadPool-3857-thread-4) [ ]
o.e.j.s.session node0 Scavenging every 600000ms
[junit4] 2> 524172 INFO (closeThreadPool-3857-thread-4) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@340687d9{/p_/n,null,AVAILABLE}
[junit4] 2> 524172 INFO (closeThreadPool-3857-thread-4) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@4dc2d83e{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:41437}
[junit4] 2> 524172 INFO (closeThreadPool-3857-thread-4) [ ]
o.e.j.s.Server Started @524223ms
[junit4] 2> 524172 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/p_/n,
solrconfig=solrconfig.xml, hostPort=41437,
coreRootDirectory=/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-4-001/cores,
replicaType=NRT}
[junit4] 2> 524176 ERROR (closeThreadPool-3857-thread-4) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 524176 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 524176 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
9.0.0
[junit4] 2> 524176 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 524176 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr
[junit4] 2> 524176 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-06-12T19:25:21.865582Z
[junit4] 2> 524191 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 524191 INFO (zkConnectionManagerCallback-3874-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 524191 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 524295 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.s.SolrDispatchFilter Loading solr.xml from SolrHome (not found in
ZooKeeper)
[junit4] 2> 524295 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.c.SolrXmlConfig Loading container configuration from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-4-001/solr.xml
[junit4] 2> 524300 INFO (closeThreadPool-3857-thread-4) [ ]
o.a.s.c.SolrXmlConfig MBean server found:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1, but no JMX reporters were
configured - adding default JMX reporter.
[junit4] 2> 524379 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
[junit4] 2> 524381 WARN (closeThreadPool-3857-thread-2) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@5f91597b[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524381 WARN (closeThreadPool-3857-thread-2) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@5f91597b[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524384 WARN (closeThreadPool-3857-thread-2) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@45284fe[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524384 WARN (closeThreadPool-3857-thread-2) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@45284fe[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524386 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42143/solr
[junit4] 2> 524387 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 524389 INFO (zkConnectionManagerCallback-3885-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 524389 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 524491 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.c.c.ConnectionManager Waiting for client
to connect to ZooKeeper
[junit4] 2> 524493 INFO (zkConnectionManagerCallback-3887-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 524493 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.c.c.ConnectionManager Client is connected
to ZooKeeper
[junit4] 2> 524500 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (1)
[junit4] 2> 524505 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.c.ZkController Publish
node=127.0.0.1:37079_p_%2Fn as DOWN
[junit4] 2> 524506 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.c.TransientSolrCoreCacheDefault
Allocating transient cache for 4 transient cores
[junit4] 2> 524506 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:37079_p_%2Fn
[junit4] 2> 524508 INFO (zkCallback-3827-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 524508 INFO (zkCallback-3855-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 524508 INFO (zkCallback-3886-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 524511 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.p.PackageLoader /packages.json updated to
version -1
[junit4] 2> 524511 WARN (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.c.CoreContainer Not all security plugins
configured! authentication=disabled authorization=disabled. Solr is only as
secure as you make it. Consider configuring authentication/authorization before
exposing Solr to users internal or external. See
https://s.apache.org/solrsecurity for more info
[junit4] 2> 524518 DEBUG (ScheduledTrigger-3833-thread-3) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 2 and last live nodes: 1
[junit4] 2> 524527 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.h.a.MetricsHistoryHandler No .system
collection, keeping metrics history in memory.
[junit4] 2> 524538 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
[junit4] 2> 524540 WARN (closeThreadPool-3857-thread-3) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@5a9ce58[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524540 WARN (closeThreadPool-3857-thread-3) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@5a9ce58[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524543 WARN (closeThreadPool-3857-thread-3) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@2455a75[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524543 WARN (closeThreadPool-3857-thread-3) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@2455a75[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524545 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42143/solr
[junit4] 2> 524547 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 524549 INFO (zkConnectionManagerCallback-3902-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 524549 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 524558 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1
[junit4] 2> 524578 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1
[junit4] 2> 524579 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1
[junit4] 2> 524581 INFO (closeThreadPool-3857-thread-2)
[n:127.0.0.1:37079_p_%2Fn ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-2-001/cores
[junit4] 2> 524593 INFO (closeThreadPool-3857-thread-2) [ ]
o.a.s.c.AbstractFullDistribZkTestBase waitForLiveNode: 127.0.0.1:37079_p_%2Fn
[junit4] 2> 524652 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.c.c.ConnectionManager Waiting for client
to connect to ZooKeeper
[junit4] 2> 524653 INFO (zkConnectionManagerCallback-3905-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 524653 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.c.c.ConnectionManager Client is connected
to ZooKeeper
[junit4] 2> 524659 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (2)
[junit4] 2> 524663 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.c.ZkController Publish
node=127.0.0.1:35875_p_%2Fn as DOWN
[junit4] 2> 524664 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.c.TransientSolrCoreCacheDefault
Allocating transient cache for 4 transient cores
[junit4] 2> 524664 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:35875_p_%2Fn
[junit4] 2> 524666 INFO (zkCallback-3855-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 524666 INFO (zkCallback-3886-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 524666 INFO (zkCallback-3904-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 524666 INFO (zkCallback-3827-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 524668 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.p.PackageLoader /packages.json updated to
version -1
[junit4] 2> 524669 WARN (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.c.CoreContainer Not all security plugins
configured! authentication=disabled authorization=disabled. Solr is only as
secure as you make it. Consider configuring authentication/authorization before
exposing Solr to users internal or external. See
https://s.apache.org/solrsecurity for more info
[junit4] 2> 524685 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.h.a.MetricsHistoryHandler No .system
collection, keeping metrics history in memory.
[junit4] 2> 524720 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1
[junit4] 2> 524728 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=false]
[junit4] 2> 524729 WARN (closeThreadPool-3857-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@575d9332[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524730 WARN (closeThreadPool-3857-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@575d9332[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524733 WARN (closeThreadPool-3857-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@7da3bf7f[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524733 WARN (closeThreadPool-3857-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@7da3bf7f[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 524735 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:42143/solr
[junit4] 2> 524736 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 524737 INFO (zkConnectionManagerCallback-3920-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 524737 INFO (closeThreadPool-3857-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 524738 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1
[junit4] 2> 524739 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@430190b1
[junit4] 2> 524741 INFO (closeThreadPool-3857-thread-3)
[n:127.0.0.1:35875_p_%2Fn ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001/shard-3-001/cores
[junit4] 2> 524756 INFO (closeThreadPool-3857-thread-3) [ ]
o.a.s.c.AbstractFullDistribZkTestBase waitForLiveNode: 127.0.0.
[...truncated too long message...]
active"}}},
[junit4] > "shard2":{
[junit4] > "range":"0-7fffffff",
[junit4] > "state":"active",
[junit4] > "replicas":{
[junit4] > "core_node7":{
[junit4] >
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node7/data/",
[junit4] > "base_url":"http://127.0.0.1:39339/p_/n",
[junit4] > "node_name":"127.0.0.1:39339_p_%2Fn",
[junit4] > "type":"NRT",
[junit4] > "force_set_state":"false",
[junit4] >
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node7/data/tlog",
[junit4] > "core":"solrj_collection_shard2_replica_n4",
[junit4] > "shared_storage":"true",
[junit4] > "state":"active",
[junit4] > "leader":"true"},
[junit4] > "core_node8":{
[junit4] >
"dataDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node8/data/",
[junit4] > "base_url":"http://127.0.0.1:39615/p_/n",
[junit4] > "node_name":"127.0.0.1:39615_p_%2Fn",
[junit4] > "type":"NRT",
[junit4] > "force_set_state":"false",
[junit4] >
"ulogDir":"hdfs://lucene2-us-west.apache.org:42984/solr_hdfs_home/solrj_collection/core_node8/data/tlog",
[junit4] > "core":"solrj_collection_shard2_replica_n6",
[junit4] > "shared_storage":"true",
[junit4] > "state":"down"}}}},
[junit4] > "router":{
[junit4] > "field":"myOwnField",
[junit4] > "name":"compositeId"},
[junit4] > "maxShardsPerNode":"2",
[junit4] > "autoAddReplicas":"true",
[junit4] > "nrtReplicas":"2",
[junit4] > "tlogReplicas":"0"} with /live_nodes:
[127.0.0.1:37079_p_%2Fn, 127.0.0.1:39339_p_%2Fn, 127.0.0.1:41437_p_%2Fn]
[junit4] > at
__randomizedtesting.SeedInfo.seed([801C4F434C624FB0:8487099E29E2248]:0)
[junit4] > at
org.apache.solr.cloud.SharedFSAutoReplicaFailoverTest.assertSliceAndReplicaCount(SharedFSAutoReplicaFailoverTest.java:415)
[junit4] > at
org.apache.solr.cloud.SharedFSAutoReplicaFailoverTest.testBasics(SharedFSAutoReplicaFailoverTest.java:222)
[junit4] > at
org.apache.solr.cloud.SharedFSAutoReplicaFailoverTest.test(SharedFSAutoReplicaFailoverTest.java:145)
[junit4] > at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit4] > at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
[junit4] > at
java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
[junit4] > at
java.base/java.lang.reflect.Method.invoke(Method.java:566)
[junit4] > at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1090)
[junit4] > at
org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1061)
[junit4] > at java.base/java.lang.Thread.run(Thread.java:834)
[junit4] 2> 670060 WARN
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.h.h.s.d.DirectoryScanner DirectoryScanner: shutdown has been called
[junit4] 2> 670066 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.w.WebAppContext@10846d54{datanode,/,null,UNAVAILABLE}{jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/datanode}
[junit4] 2> 670067 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.AbstractConnector Stopped ServerConnector@157710f0{HTTP/1.1,
(http/1.1)}{localhost:0}
[junit4] 2> 670067 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session node0 Stopped scavenging
[junit4] 2> 670067 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.s.ServletContextHandler@50b28ad7{static,/static,jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/static,UNAVAILABLE}
[junit4] 2> 670068 WARN (BP-1193956414-127.0.0.1-1591989916638
heartbeating to lucene2-us-west.apache.org/127.0.0.1:42984) [ ]
o.a.h.h.s.d.IncrementalBlockReportManager IncrementalBlockReportManager
interrupted
[junit4] 2> 670068 WARN (BP-1193956414-127.0.0.1-1591989916638
heartbeating to lucene2-us-west.apache.org/127.0.0.1:42984) [ ]
o.a.h.h.s.d.DataNode Ending block pool service for: Block pool
BP-1193956414-127.0.0.1-1591989916638 (Datanode Uuid
f382350e-c34b-47af-ad4e-1c89e3e3ac6d) service to
lucene2-us-west.apache.org/127.0.0.1:42984
[junit4] 2> 670106 WARN
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.a.h.h.s.d.DirectoryScanner DirectoryScanner: shutdown has been called
[junit4] 2> 670120 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.w.WebAppContext@151b3feb{datanode,/,null,UNAVAILABLE}{jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/datanode}
[junit4] 2> 670120 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.AbstractConnector Stopped ServerConnector@6d598862{HTTP/1.1,
(http/1.1)}{localhost:0}
[junit4] 2> 670120 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session node0 Stopped scavenging
[junit4] 2> 670120 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.s.ServletContextHandler@467b9573{static,/static,jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/static,UNAVAILABLE}
[junit4] 2> 670135 WARN (BP-1193956414-127.0.0.1-1591989916638
heartbeating to lucene2-us-west.apache.org/127.0.0.1:42984) [ ]
o.a.h.h.s.d.IncrementalBlockReportManager IncrementalBlockReportManager
interrupted
[junit4] 2> 670135 WARN (BP-1193956414-127.0.0.1-1591989916638
heartbeating to lucene2-us-west.apache.org/127.0.0.1:42984) [ ]
o.a.h.h.s.d.DataNode Ending block pool service for: Block pool
BP-1193956414-127.0.0.1-1591989916638 (Datanode Uuid
f044cb6d-5d84-4278-a2f2-7ef7ba69fe9a) service to
lucene2-us-west.apache.org/127.0.0.1:42984
[junit4] 2> 670220 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.w.WebAppContext@31c9e0e6{hdfs,/,null,UNAVAILABLE}{jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/hdfs}
[junit4] 2> 670221 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.AbstractConnector Stopped ServerConnector@28ce30a3{HTTP/1.1,
(http/1.1)}{lucene2-us-west.apache.org:0}
[junit4] 2> 670221 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.session node0 Stopped scavenging
[junit4] 2> 670221 INFO
(SUITE-SharedFSAutoReplicaFailoverTest-seed#[801C4F434C624FB0]-worker) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.s.ServletContextHandler@146401d3{static,/static,jar:file:/home/jenkins/.ivy2/cache/org.apache.hadoop/hadoop-hdfs/tests/hadoop-hdfs-3.2.0-tests.jar!/webapps/static,UNAVAILABLE}
[junit4] 2> NOTE: leaving temporary files on disk at:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-BadApples-NightlyTests-master/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.SharedFSAutoReplicaFailoverTest_801C4F434C624FB0-001
[junit4] 2> Jun 12, 2020 7:27:48 PM
com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
[junit4] 2> WARNING: Will linger awaiting termination of 65 leaked
thread(s).
[junit4] 2> NOTE: test params are: codec=Asserting(Lucene86):
{_root_=PostingsFormat(name=LuceneVarGapDocFreqInterval),
id=BlockTreeOrds(blocksize=128),
text=TestBloomFilteredLucenePostings(BloomFilteringPostingsFormat(Lucene84))},
docValues:{_version_=DocValuesFormat(name=Lucene80)}, maxPointsInLeafNode=1828,
maxMBSortInHeap=6.6590828650029685,
sim=Asserting(org.apache.lucene.search.similarities.AssertingSimilarity@4f28f714),
locale=sn-ZW, timezone=Africa/Dar_es_Salaam
[junit4] 2> NOTE: Linux 4.4.0-170-generic amd64/Oracle Corporation 11.0.4
(64-bit)/cpus=8,threads=9,free=86925848,total=536870912
[junit4] 2> NOTE: All tests run in this JVM: [ZkStateReaderTest,
TestMultiValuedNumericRangeQuery, CurrencyRangeFacetCloudTest,
JWTAuthPluginIntegrationTest, TestTlogReplayVsRecovery, RandomizedTaggerTest,
TestSimUtils, SolrCloudReportersTest, TestAnalyzedSuggestions, TestUpdate,
DistributedQueryComponentCustomSortTest, TestDownShardTolerantSearch,
QueryParsingTest, IndexSchemaRuntimeFieldTest, TestDynamicURP,
TestCollapseQParserPlugin, CSVRequestHandlerTest, SuggesterTest,
TestPayloadScoreQParserPlugin, DistributedSpellCheckComponentTest,
BufferStoreTest, SyncSliceTest, TestRawTransformer, TestJsonRequest,
ScheduledMaintenanceTriggerTest, TestFilteredDocIdSet,
TestTolerantUpdateProcessorRandomCloud, TestDistributedTracing,
FieldMutatingUpdateProcessorTest, TestReplicationHandlerDiskOverFlow,
TestNumericTokenStream, TestDistributedGrouping, DateRangeFieldTest,
HdfsRestartWhileUpdatingTest, SecurityConfHandlerTest, AuthToolTest,
HttpPartitionWithTlogReplicasTest, RequestLoggingTest, LeaderTragicEventTest,
SharedFSAutoReplicaFailoverTest]
[junit4] Completed [106/910 (1!)] on J2 in 154.38s, 1 test, 1 failure <<<
FAILURES!
[...truncated 54785 lines...]
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]