Build: https://builds.apache.org/job/Lucene-Solr-NightlyTests-7.7/16/
2 tests failed.
FAILED: org.apache.solr.cloud.OverseerTest.testShardLeaderChange
Error Message:
Stack Trace:
org.apache.solr.common.AlreadyClosedException
at
__randomizedtesting.SeedInfo.seed([C65F55BA4F749C69:180CD24D55EC6998]:0)
at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:69)
at
org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:544)
at
org.apache.solr.common.cloud.ZkCmdExecutor.ensureExists(ZkCmdExecutor.java:112)
at
org.apache.solr.common.cloud.ZkCmdExecutor.ensureExists(ZkCmdExecutor.java:93)
at
org.apache.solr.cloud.OverseerElectionContext.<init>(ElectionContext.java:825)
at
org.apache.solr.cloud.OverseerTest.electNewOverseer(OverseerTest.java:1420)
at
org.apache.solr.cloud.OverseerTest.testShardLeaderChange(OverseerTest.java:905)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.lang.Thread.run(Thread.java:748)
FAILED: org.apache.solr.cloud.TestStressCloudBlindAtomicUpdates.test_dv
Error Message:
Some docs had errors -- check logs expected:<0> but was:<3>
Stack Trace:
java.lang.AssertionError: Some docs had errors -- check logs expected:<0> but
was:<3>
at
__randomizedtesting.SeedInfo.seed([C65F55BA4F749C69:F04B37FCC529A678]:0)
at org.junit.Assert.fail(Assert.java:88)
at org.junit.Assert.failNotEquals(Assert.java:834)
at org.junit.Assert.assertEquals(Assert.java:645)
at
org.apache.solr.cloud.TestStressCloudBlindAtomicUpdates.checkField(TestStressCloudBlindAtomicUpdates.java:352)
at
org.apache.solr.cloud.TestStressCloudBlindAtomicUpdates.test_dv(TestStressCloudBlindAtomicUpdates.java:207)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:498)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.lang.Thread.run(Thread.java:748)
Build Log:
[...truncated 14936 lines...]
[junit4] Suite: org.apache.solr.cloud.OverseerTest
[junit4] 2> 4667126 INFO
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.SolrTestCaseJ4
SecureRandom sanity checks: test.solr.allowed.securerandom=null &
java.security.egd=file:/dev/./urandom
[junit4] 2> Creating dataDir:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/solr/build/solr-core/test/J0/temp/solr.cloud.OverseerTest_C65F55BA4F749C69-001/init-core-data-001
[junit4] 2> 4667126 WARN
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.SolrTestCaseJ4
startTrackingSearchers: numOpens=3 numCloses=3
[junit4] 2> 4667126 INFO
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.SolrTestCaseJ4
Using PointFields (NUMERIC_POINTS_SYSPROP=true)
w/NUMERIC_DOCVALUES_SYSPROP=false
[junit4] 2> 4667144 INFO
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.SolrTestCaseJ4
Randomized ssl (false) and clientAuth (false) via:
@org.apache.solr.util.RandomizeSSL(reason=, ssl=NaN, value=NaN, clientAuth=NaN)
[junit4] 2> 4667145 INFO
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.c.ZkTestServer
STARTING ZK TEST SERVER
[junit4] 2> 4667145 INFO (ZkTestServer Run Thread) [ ]
o.a.s.c.ZkTestServer client port:0.0.0.0/0.0.0.0:0
[junit4] 2> 4667145 INFO (ZkTestServer Run Thread) [ ]
o.a.s.c.ZkTestServer Starting server
[junit4] 2> 4667253 INFO
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.c.ZkTestServer
start zk server on port:37637
[junit4] 2> 4667253 INFO
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.c.ZkTestServer
parse host and port list: 127.0.0.1:37637
[junit4] 2> 4667253 INFO
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.c.ZkTestServer
connecting to 127.0.0.1 37637
[junit4] 2> 4667272 INFO (zkConnectionManagerCallback-7657-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4667318 INFO (zkConnectionManagerCallback-7659-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4667318 INFO
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.SolrTestCaseJ4
####initCore
[junit4] 2> 4667318 INFO
(SUITE-OverseerTest-seed#[C65F55BA4F749C69]-worker) [ ] o.a.s.SolrTestCaseJ4
####initCore end
[junit4] 2> 4667326 INFO
(TEST-OverseerTest.testReplay-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testReplay
[junit4] 2> 4667539 INFO (zkConnectionManagerCallback-7663-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4668088 INFO (zkConnectionManagerCallback-7669-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4668700 INFO (zkConnectionManagerCallback-7674-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4668701 INFO
(TEST-OverseerTest.testReplay-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4668703 INFO
(TEST-OverseerTest.testReplay-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4668720 INFO
(TEST-OverseerTest.testReplay-seed#[C65F55BA4F749C69]) [ ] o.a.s.c.Overseer
Overseer (id=74723108933795842-127.0.0.1:37637_solr-n_0000000000) starting
[junit4] 2> 4668739 INFO
(OverseerStateUpdate-74723108933795842-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4668767 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795842-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: []
[junit4] 2> 4668777 DEBUG (ScheduledTrigger-7839-thread-3) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 0 and last live nodes: 0
[junit4] 2> 4669000 INFO (closeThreadPool-7676-thread-1) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795842-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4669000 INFO
(OverseerStateUpdate-74723108933795842-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4669001 INFO
(OverseerAutoScalingTriggerThread-74723108933795842-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we
are closed, exiting.
[junit4] 2> 4669006 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer
Error communicating with ZooKeeper
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /overseer_elect/leader
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1221)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getData$5(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.checkIfIamStillLeader(Overseer.java:319)
~[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4669097 INFO
(TEST-OverseerTest.testReplay-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testReplay
[junit4] 2> 4669123 INFO
(TEST-OverseerTest.testStateChange-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testStateChange
[junit4] 2> 4669270 INFO (zkConnectionManagerCallback-7680-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4669273 INFO (zkConnectionManagerCallback-7686-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4669276 INFO (zkConnectionManagerCallback-7691-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4669277 INFO
(TEST-OverseerTest.testStateChange-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4669279 INFO
(TEST-OverseerTest.testStateChange-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4669280 INFO
(TEST-OverseerTest.testStateChange-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795845-127.0.0.1:37637_solr-n_0000000000) starting
[junit4] 2> 4669293 INFO
(OverseerStateUpdate-74723108933795845-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4669345 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795845-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: []
[junit4] 2> 4669346 DEBUG (ScheduledTrigger-7844-thread-1) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 0 and last live nodes: 0
[junit4] 2> 4669559 INFO (closeThreadPool-7693-thread-1) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795845-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4669559 INFO
(OverseerStateUpdate-74723108933795845-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer According to ZK I
(id=74723108933795845-127.0.0.1:37637_solr-n_0000000000) am no longer a leader.
propsId=null
[junit4] 2> 4669559 INFO
(OverseerStateUpdate-74723108933795845-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4669560 INFO
(OverseerAutoScalingTriggerThread-74723108933795845-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we
are closed, exiting.
[junit4] 2> 4669594 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer
Error communicating with ZooKeeper
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /overseer_elect/leader
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1221)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getData$5(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.checkIfIamStillLeader(Overseer.java:319)
~[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4669736 INFO
(TEST-OverseerTest.testStateChange-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testStateChange
[junit4] 2> 4669791 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testDownNodeFailover
[junit4] 2> 4669965 INFO (zkConnectionManagerCallback-7695-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4669999 INFO (zkConnectionManagerCallback-7701-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4670002 INFO (zkConnectionManagerCallback-7706-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4670012 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4670016 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4670017 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795848-127.0.0.1:37637_solr-n_0000000000) starting
[junit4] 2> 4670054 INFO
(OverseerStateUpdate-74723108933795848-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4670058 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795848-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: []
[junit4] 2> 4670070 DEBUG (ScheduledTrigger-7849-thread-2) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 0 and last live nodes: 0
[junit4] 2> 4670080 INFO (zkConnectionManagerCallback-7710-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4670100 INFO (zkCallback-7694-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4670100 INFO (zkCallback-7658-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4670101 INFO (zkCallback-7705-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4670102 INFO (zkCallback-7709-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4670102 INFO (zkConnectionManagerCallback-7717-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4670103 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4670103 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4670240 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection0/leaders/shard1
[junit4] 2> 4670254 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection0/leaders/shard1/leader after winning as
/collections/collection0/leader_elect/shard1/election/74723108933795851-127.0.0.1_core1-n_0000000000
[junit4] 2> 4670422 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard1
[junit4] 2> 4670423 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard1/leader after winning as
/collections/collection1/leader_elect/shard1/election/74723108933795851-127.0.0.1_core1-n_0000000000
[junit4] 2> 4670576 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection2/leaders/shard1
[junit4] 2> 4670577 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection2/leaders/shard1/leader after winning as
/collections/collection2/leader_elect/shard1/election/74723108933795851-127.0.0.1_core1-n_0000000000
[junit4] 2> 4670734 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection3/leaders/shard1
[junit4] 2> 4670752 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection3/leaders/shard1/leader after winning as
/collections/collection3/leader_elect/shard1/election/74723108933795851-127.0.0.1_core1-n_0000000000
[junit4] 2> 4670917 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection4/leaders/shard1
[junit4] 2> 4670934 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection4/leaders/shard1/leader after winning as
/collections/collection4/leader_elect/shard1/election/74723108933795851-127.0.0.1_core1-n_0000000000
[junit4] 2> 4671043 INFO (zkConnectionManagerCallback-7719-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4671043 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795848-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4671043 INFO
(OverseerAutoScalingTriggerThread-74723108933795848-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we
are closed, exiting.
[junit4] 2> 4671051 INFO
(OverseerStateUpdate-74723108933795848-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer According to ZK I
(id=74723108933795848-127.0.0.1:37637_solr-n_0000000000) am no longer a leader.
propsId=null
[junit4] 2> 4671051 INFO
(OverseerStateUpdate-74723108933795848-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4671067 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer
Error communicating with ZooKeeper
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /overseer_elect/leader
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1221)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getData$5(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.checkIfIamStillLeader(Overseer.java:319)
~[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4671081 INFO (zkConnectionManagerCallback-7725-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4671096 INFO (zkConnectionManagerCallback-7730-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4671097 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4671098 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4671099 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4671099 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795853-127.0.0.1:37637_solr-n_0000000001) starting
[junit4] 2> 4671124 INFO
(OverseerStateUpdate-74723108933795853-127.0.0.1:37637_solr-n_0000000001) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4671126 INFO
(OverseerStateUpdate-74723108933795853-127.0.0.1:37637_solr-n_0000000001) [
] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4671153 INFO (zkCallback-7716-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4671153 INFO (zkCallback-7705-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4671153 INFO (zkCallback-7729-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4671153 INFO (zkCallback-7658-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4671153 INFO (zkCallback-7718-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4671153 INFO (zkCallback-7709-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4671155 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795853-127.0.0.1:37637_solr-n_0000000001)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: []
[junit4] 2> 4671170 DEBUG (ScheduledTrigger-7854-thread-1) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 0 and last live nodes: 0
[junit4] 2> 4671201 INFO (closeThreadPool-7732-thread-1) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795848-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4671201 INFO (closeThreadPool-7732-thread-2) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795853-127.0.0.1:37637_solr-n_0000000001) closing
[junit4] 2> 4671201 INFO
(OverseerStateUpdate-74723108933795853-127.0.0.1:37637_solr-n_0000000001) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4671213 INFO
(OverseerAutoScalingTriggerThread-74723108933795853-127.0.0.1:37637_solr-n_0000000001)
[ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we
are closed, exiting.
[junit4] 2> 4671215 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer
Error communicating with ZooKeeper
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /overseer_elect/leader
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1221)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getData$5(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.checkIfIamStillLeader(Overseer.java:319)
~[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4671344 INFO
(TEST-OverseerTest.testDownNodeFailover-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testDownNodeFailover
[junit4] 2> 4671362 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testBadQueueItem
[junit4] 2> 4671581 ERROR (Finalizer) [ ] o.a.s.c.CoreContainer
CoreContainer was not close prior to finalize(), indicates a bug -- POSSIBLE
RESOURCE LEAK!!! instance=2013987747
[junit4] 2> 4671581 ERROR (Finalizer) [ ] o.a.s.c.CoreContainer
CoreContainer was not close prior to finalize(), indicates a bug -- POSSIBLE
RESOURCE LEAK!!! instance=1086989557
[junit4] 2> 4671581 ERROR (Finalizer) [ ] o.a.s.c.CoreContainer
CoreContainer was not close prior to finalize(), indicates a bug -- POSSIBLE
RESOURCE LEAK!!! instance=1236901821
[junit4] 2> 4671582 ERROR (Finalizer) [ ] o.a.s.c.CoreContainer
CoreContainer was not close prior to finalize(), indicates a bug -- POSSIBLE
RESOURCE LEAK!!! instance=949151302
[junit4] 2> 4671629 INFO (zkConnectionManagerCallback-7734-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4671645 INFO (zkConnectionManagerCallback-7740-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4671659 INFO (zkConnectionManagerCallback-7745-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4671661 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4671662 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4671671 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795856-127.0.0.1:37637_solr-n_0000000000) starting
[junit4] 2> 4671686 INFO
(OverseerStateUpdate-74723108933795856-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4671687 INFO (zkConnectionManagerCallback-7749-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4671690 INFO (zkCallback-7658-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4671690 INFO (zkCallback-7748-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4671718 INFO (zkCallback-7744-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4671718 INFO
(OverseerStateUpdate-74723108933795856-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4671745 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795856-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: [127.0.0.1]
[junit4] 2> 4671747 DEBUG (ScheduledTrigger-7859-thread-2) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 1 and last live nodes: 1
[junit4] 2> 4671860 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard1
[junit4] 2> 4671861 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard1/leader after winning as
/collections/collection1/leader_elect/shard1/election/74723108933795859-127.0.0.1_core1-n_0000000000
[junit4] 2> 4672088 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard2
[junit4] 2> 4672107 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard2/leader after winning as
/collections/collection1/leader_elect/shard2/election/74723108933795859-127.0.0.1_core2-n_0000000000
[junit4] 2> 4672241 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard3
[junit4] 2> 4672250 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard3/leader after winning as
/collections/collection1/leader_elect/shard3/election/74723108933795859-127.0.0.1_core3-n_0000000000
[junit4] 2> 4672379 ERROR
(OverseerStateUpdate-74723108933795856-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.o.CollectionMutator Skipping invalid Overseer message because it has
no collection specified: {
[junit4] 2> "operation":"state",
[junit4] 2> "state":"active",
[junit4] 2> "node_name":"127.0.0.1",
[junit4] 2> "core":"core0",
[junit4] 2> "core_node_name":"node0",
[junit4] 2> "collection":"",
[junit4] 2> "shard":"shard1",
[junit4] 2> "numShards":"1",
[junit4] 2> "base_url":"http://127.0.0.1/solr/"}
[junit4] 2> 4672393 ERROR
(OverseerStateUpdate-74723108933795856-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.o.CollectionMutator Skipping invalid Overseer message because it has
no collection specified: {
[junit4] 2> "operation":"deletecore",
[junit4] 2> "node_name":"127.0.0.1",
[junit4] 2> "core":"core0",
[junit4] 2> "core_node_name":"node0",
[junit4] 2> "collection":""}
[junit4] 2> 4672531 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection2/leaders/shard1
[junit4] 2> 4672532 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection2/leaders/shard1/leader after winning as
/collections/collection2/leader_elect/shard1/election/74723108933795859-127.0.0.1_core1-n_0000000000
[junit4] 2> 4672673 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection2/leaders/shard2
[junit4] 2> 4672674 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection2/leaders/shard2/leader after winning as
/collections/collection2/leader_elect/shard2/election/74723108933795859-127.0.0.1_core2-n_0000000000
[junit4] 2> 4672748 DEBUG (ScheduledTrigger-7859-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> 4672809 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection2/leaders/shard3
[junit4] 2> 4672826 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection2/leaders/shard3/leader after winning as
/collections/collection2/leader_elect/shard3/election/74723108933795859-127.0.0.1_core3-n_0000000000
[junit4] 2> 4672959 INFO (zkCallback-7658-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4672959 INFO (zkCallback-7733-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4672959 INFO (zkCallback-7744-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4672960 INFO (zkCallback-7748-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4672980 INFO (closeThreadPool-7753-thread-1) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795856-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4672980 INFO
(OverseerStateUpdate-74723108933795856-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4672980 INFO
(OverseerAutoScalingTriggerThread-74723108933795856-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we
are closed, exiting.
[junit4] 2> 4672982 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer
Error communicating with ZooKeeper
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /overseer_elect/leader
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1221)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getData$5(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.checkIfIamStillLeader(Overseer.java:319)
~[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4673088 INFO
(TEST-OverseerTest.testBadQueueItem-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testBadQueueItem
[junit4] 2> 4673116 INFO
(TEST-OverseerTest.testLatchWatcher-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testLatchWatcher
[junit4] 2> 4673252 INFO
(TEST-OverseerTest.testLatchWatcher-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testLatchWatcher
[junit4] 2> 4673257 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testOverseerStatsReset
[junit4] 2> 4673487 INFO (zkConnectionManagerCallback-7759-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4673506 INFO (zkCallback-7658-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4673508 INFO (zkCallback-7758-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4673524 INFO (zkConnectionManagerCallback-7766-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4673525 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4673525 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4673580 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4673581 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) starting
[junit4] 2> 4673598 INFO
(OverseerStateUpdate-74723108933795841-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4673666 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795841-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: [node1]
[junit4] 2> 4673681 DEBUG (ScheduledTrigger-7864-thread-2) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 1 and last live nodes: 1
[junit4] 2> 4673768 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard1
[junit4] 2> 4673769 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard1/leader after winning as
/collections/collection1/leader_elect/shard1/election/74723108933795860-node1_core1-n_0000000000
[junit4] 2> 4673770 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4673770 INFO
(OverseerAutoScalingTriggerThread-74723108933795841-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we
are closed, exiting.
[junit4] 2> 4673771 INFO
(OverseerStateUpdate-74723108933795841-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4673772 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4673772 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4673772 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4673773 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4673786 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer I
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) am exiting, but I'm
still the leader
[junit4] 2> 4673786 ERROR
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.LeaderElector node exists
[junit4] 2> org.apache.zookeeper.KeeperException$NodeExistsException:
KeeperErrorCode = NodeExists for /overseer_elect/leader
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:122)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.create(ZooKeeper.java:792)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$makePath$8(SolrZkClient.java:545)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:544)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:488)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.makePath(SolrZkClient.java:475)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.OverseerElectionContext.runLeaderProcess(ElectionContext.java:842)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.LeaderElector.runIamLeaderProcess(LeaderElector.java:171)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.LeaderElector.checkIfIamLeader(LeaderElector.java:136)
[java/:?]
[junit4] 2> at
org.apache.solr.cloud.LeaderElector.joinElection(LeaderElector.java:308)
[java/:?]
[junit4] 2> at
org.apache.solr.cloud.LeaderElector.joinElection(LeaderElector.java:217)
[java/:?]
[junit4] 2> at
org.apache.solr.cloud.OverseerTest.testOverseerStatsReset(OverseerTest.java:757)
[test/:?]
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native
Method) ~[?:1.8.0_191]
[junit4] 2> at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
~[?:1.8.0_191]
[junit4] 2> at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
~[?:1.8.0_191]
[junit4] 2> at java.lang.reflect.Method.invoke(Method.java:498)
~[?:1.8.0_191]
[junit4] 2> at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
[java/:?]
[junit4] 2> at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
[java/:?]
[junit4] 2> at
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
[java/:?]
[junit4] 2> at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
[java/:?]
[junit4] 2> at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
[java/:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
[java/:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
[java/:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
[java/:?]
[junit4] 2> at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
[java/:?]
[junit4] 2> at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
[java/:?]
[junit4] 2> at
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
[java/:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
[randomizedtesting-runner-2.7.2.jar:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4673788 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4673788 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4673788 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4673788 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4673788 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4673789 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000002) starting
[junit4] 2> 4673804 INFO
(OverseerStateUpdate-74723108933795841-127.0.0.1:37637_solr-n_0000000002) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4673815 INFO (zkCallback-7765-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4673815 INFO (zkCallback-7758-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4673816 INFO (zkCallback-7658-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4673830 WARN (ScheduledTrigger-7868-thread-1) [ ]
o.a.s.c.a.TriggerBase Exception getting trigger state
'/autoscaling/triggerState/.scheduled_maintenance'
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for
/autoscaling/triggerState/.scheduled_maintenance
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.exists(ZooKeeper.java:1111)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$exists$3(SolrZkClient.java:334)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.exists(SolrZkClient.java:334)
~[java/:?]
[junit4] 2> at
org.apache.solr.client.solrj.impl.ZkDistribStateManager.hasData(ZkDistribStateManager.java:59)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.autoscaling.TriggerBase.restoreState(TriggerBase.java:266)
[java/:?]
[junit4] 2> at
org.apache.solr.cloud.autoscaling.ScheduledTriggers$TriggerWrapper.run(ScheduledTriggers.java:621)
[java/:?]
[junit4] 2> at
java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:511)
[?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.FutureTask.runAndReset(FutureTask.java:308) [?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.access$301(ScheduledThreadPoolExecutor.java:180)
[?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(ScheduledThreadPoolExecutor.java:294)
[?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
[?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
[?:1.8.0_191]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4673831 WARN (ScheduledTrigger-7868-thread-1) [ ]
o.a.s.c.a.TriggerBase Exception updating trigger state
'/autoscaling/triggerState/.scheduled_maintenance'
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for
/autoscaling/triggerState/.scheduled_maintenance
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.exists(ZooKeeper.java:1111)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$exists$3(SolrZkClient.java:334)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.exists(SolrZkClient.java:334)
~[java/:?]
[junit4] 2> at
org.apache.solr.client.solrj.impl.ZkDistribStateManager.hasData(ZkDistribStateManager.java:59)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.autoscaling.TriggerBase.saveState(TriggerBase.java:246)
[java/:?]
[junit4] 2> at
org.apache.solr.cloud.autoscaling.ScheduledTriggers$TriggerWrapper.run(ScheduledTriggers.java:643)
[java/:?]
[junit4] 2> at
java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:511)
[?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.FutureTask.runAndReset(FutureTask.java:308) [?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.access$301(ScheduledThreadPoolExecutor.java:180)
[?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(ScheduledThreadPoolExecutor.java:294)
[?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1149)
[?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624)
[?:1.8.0_191]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4673850 INFO (closeThreadPool-7770-thread-1) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000002) closing
[junit4] 2> 4673850 INFO
(OverseerStateUpdate-74723108933795841-127.0.0.1:37637_solr-n_0000000002) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4673858 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer I
(id=74723108933795841-127.0.0.1:37637_solr-n_0000000002) am exiting, but I'm
still the leader
[junit4] 2> 4673887 WARN
(OverseerAutoScalingTriggerThread-74723108933795841-127.0.0.1:37637_solr-n_0000000002)
[ ] o.a.s.c.a.OverseerTriggerThread Error removing old markers
[junit4] 2> org.apache.solr.common.AlreadyClosedException: null
[junit4] 2> at
org.apache.solr.client.solrj.impl.ZkDistribStateManager.listData(ZkDistribStateManager.java:74)
~[java/:?]
[junit4] 2> at
org.apache.solr.client.solrj.impl.ZkDistribStateManager.listData(ZkDistribStateManager.java:80)
~[java/:?]
[junit4] 2> at
org.apache.solr.client.solrj.cloud.DistribStateManager.listTree(DistribStateManager.java:104)
~[java/:?]
[junit4] 2> at
org.apache.solr.client.solrj.cloud.DistribStateManager.removeRecursively(DistribStateManager.java:123)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.autoscaling.OverseerTriggerThread.removeMarkers(OverseerTriggerThread.java:264)
[java/:?]
[junit4] 2> at
org.apache.solr.cloud.autoscaling.OverseerTriggerThread.run(OverseerTriggerThread.java:256)
[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4673887 WARN
(OverseerAutoScalingTriggerThread-74723108933795841-127.0.0.1:37637_solr-n_0000000002)
[ ] o.a.s.c.a.OverseerTriggerThread Error removing old markers
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /autoscaling/nodeAdded
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getChildren(ZooKeeper.java:1541)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getChildren$4(SolrZkClient.java:346)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getChildren(SolrZkClient.java:346)
~[java/:?]
[junit4] 2> at
org.apache.solr.client.solrj.impl.ZkDistribStateManager.listData(ZkDistribStateManager.java:69)
~[java/:?]
[junit4] 2> at
org.apache.solr.client.solrj.impl.ZkDistribStateManager.listData(ZkDistribStateManager.java:80)
~[java/:?]
[junit4] 2> at
org.apache.solr.client.solrj.cloud.DistribStateManager.listTree(DistribStateManager.java:104)
~[java/:?]
[junit4] 2> at
org.apache.solr.client.solrj.cloud.DistribStateManager.removeRecursively(DistribStateManager.java:123)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.autoscaling.OverseerTriggerThread.removeMarkers(OverseerTriggerThread.java:264)
[java/:?]
[junit4] 2> at
org.apache.solr.cloud.autoscaling.OverseerTriggerThread.run(OverseerTriggerThread.java:257)
[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4673887 WARN
(OverseerAutoScalingTriggerThread-74723108933795841-127.0.0.1:37637_solr-n_0000000002)
[ ] o.a.s.c.a.OverseerTriggerThread Interrupted
[junit4] 2> java.lang.InterruptedException: null
[junit4] 2> at
java.util.concurrent.locks.AbstractQueuedSynchronizer.acquireInterruptibly(AbstractQueuedSynchronizer.java:1220)
~[?:1.8.0_191]
[junit4] 2> at
java.util.concurrent.locks.ReentrantLock.lockInterruptibly(ReentrantLock.java:335)
~[?:1.8.0_191]
[junit4] 2> at
org.apache.solr.cloud.autoscaling.OverseerTriggerThread.run(OverseerTriggerThread.java:188)
[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4673966 INFO
(TEST-OverseerTest.testOverseerStatsReset-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testOverseerStatsReset
[junit4] 2> 4674003 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testOverseerFailure
[junit4] 2> 4674237 INFO (zkConnectionManagerCallback-7774-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4674268 INFO (zkCallback-7658-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4674269 INFO (zkCallback-7773-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4674269 INFO (zkConnectionManagerCallback-7778-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4674274 INFO (zkConnectionManagerCallback-7784-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4674290 INFO (zkConnectionManagerCallback-7789-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4674291 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4674291 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4674318 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4674319 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795863-127.0.0.1:37637_solr-n_0000000000) starting
[junit4] 2> 4674349 INFO
(OverseerStateUpdate-74723108933795863-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4674350 INFO
(OverseerStateUpdate-74723108933795863-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4674497 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795863-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: [node1]
[junit4] 2> 4674497 DEBUG (ScheduledTrigger-7873-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> 4674499 INFO (zkConnectionManagerCallback-7794-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4674512 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4674513 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4674618 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard1
[junit4] 2> 4674619 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard1/leader after winning as
/collections/collection1/leader_elect/shard1/election/74723108933795862-node1_core1-n_0000000000
[junit4] 2> 4674687 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard1
[junit4] 2> 4674688 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard1/leader after winning as
/collections/collection1/leader_elect/shard1/election/74723108933795862-node1_core1-n_0000000001
[junit4] 2> 4674819 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard1
[junit4] 2> 4674820 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard1/leader after winning as
/collections/collection1/leader_elect/shard1/election/74723108933795862-node1_core1-n_0000000002
[junit4] 2> 4674860 INFO (zkConnectionManagerCallback-7796-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4674861 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795863-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4674861 INFO
(OverseerStateUpdate-74723108933795863-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4674884 INFO
(OverseerAutoScalingTriggerThread-74723108933795863-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we
are closed, exiting.
[junit4] 2> 4674885 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer
Error communicating with ZooKeeper
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /overseer_elect/leader
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1221)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getData$5(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.checkIfIamStillLeader(Overseer.java:319)
~[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4674920 INFO (zkConnectionManagerCallback-7802-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4674923 INFO (zkConnectionManagerCallback-7807-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4674936 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4674937 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4674938 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4674938 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795867-127.0.0.1:37637_solr-n_0000000001) starting
[junit4] 2> 4674974 INFO
(OverseerStateUpdate-74723108933795867-127.0.0.1:37637_solr-n_0000000001) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4674975 INFO
(OverseerStateUpdate-74723108933795867-127.0.0.1:37637_solr-n_0000000001) [
] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4675042 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795867-127.0.0.1:37637_solr-n_0000000001)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: [node1]
[junit4] 2> 4675044 DEBUG (ScheduledTrigger-7878-thread-2) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 1 and last live nodes: 1
[junit4] 2> 4675150 INFO (zkCallback-7773-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4675150 INFO (zkCallback-7788-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4675150 INFO (zkCallback-7793-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4675150 INFO (zkCallback-7806-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4675163 INFO (zkCallback-7658-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4675163 INFO (zkCallback-7795-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4675204 INFO (closeThreadPool-7809-thread-1) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795863-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4675204 INFO (closeThreadPool-7809-thread-2) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795867-127.0.0.1:37637_solr-n_0000000001) closing
[junit4] 2> 4675205 INFO
(OverseerStateUpdate-74723108933795867-127.0.0.1:37637_solr-n_0000000001) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4675205 INFO
(OverseerAutoScalingTriggerThread-74723108933795867-127.0.0.1:37637_solr-n_0000000001)
[ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we
are closed, exiting.
[junit4] 2> 4675224 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer
Error communicating with ZooKeeper
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /overseer_elect/leader
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1221)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getData$5(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.checkIfIamStillLeader(Overseer.java:319)
~[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4675328 INFO
(TEST-OverseerTest.testOverseerFailure-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testOverseerFailure
[junit4] 2> 4675355 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting testShardAssignment
[junit4] 2> 4675511 INFO (zkConnectionManagerCallback-7811-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4675514 INFO (zkConnectionManagerCallback-7817-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4675517 INFO (zkConnectionManagerCallback-7822-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4675518 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:37637/solr ready
[junit4] 2> 4675536 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:37637_solr
[junit4] 2> 4675537 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795870-127.0.0.1:37637_solr-n_0000000000) starting
[junit4] 2> 4675542 INFO
(OverseerStateUpdate-74723108933795870-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4675554 INFO (zkConnectionManagerCallback-7826-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4675555 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795870-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: []
[junit4] 2> 4675568 DEBUG (ScheduledTrigger-7883-thread-1) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 0 and last live nodes: 0
[junit4] 2> 4675571 INFO (zkCallback-7658-thread-4) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4675571 INFO (zkCallback-7810-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4675571 INFO (zkCallback-7821-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4675571 INFO (zkCallback-7825-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
[junit4] 2> 4675685 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard1
[junit4] 2> 4675686 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard1/leader after winning as
/collections/collection1/leader_elect/shard1/election/74723108933795873-127.0.0.1_core1-n_0000000000
[junit4] 2> 4675797 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard2
[junit4] 2> 4675798 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard2/leader after winning as
/collections/collection1/leader_elect/shard2/election/74723108933795873-127.0.0.1_core2-n_0000000000
[junit4] 2> 4675916 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard3
[junit4] 2> 4675926 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/collection1/leaders/shard3/leader after winning as
/collections/collection1/leader_elect/shard3/election/74723108933795873-127.0.0.1_core3-n_0000000000
[junit4] 2> 4676032 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard1
[junit4] 2> 4676171 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard2
[junit4] 2> 4676317 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/collection1/leaders/shard3
[junit4] 2> 4676363 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase No version found for ephemeral leader
parent node, won't remove previous leader registration.
[junit4] 2> 4676363 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase No version found for ephemeral leader
parent node, won't remove previous leader registration.
[junit4] 2> 4676363 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.c.ShardLeaderElectionContextBase No version found for ephemeral leader
parent node, won't remove previous leader registration.
[junit4] 2> 4676364 WARN (zkCallback-7825-thread-1) [ ]
o.a.s.c.LeaderElector Our node is no longer in line to be leader
[junit4] 2> 4676364 WARN (zkCallback-7825-thread-1) [ ]
o.a.s.c.LeaderElector Our node is no longer in line to be leader
[junit4] 2> 4676365 WARN (zkCallback-7825-thread-1) [ ]
o.a.s.c.LeaderElector Our node is no longer in line to be leader
[junit4] 2> 4676366 INFO (zkCallback-7658-thread-4) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4676366 INFO (zkCallback-7810-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4676366 INFO (zkCallback-7821-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4676383 INFO (zkCallback-7825-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0)
[junit4] 2> 4676441 WARN (NIOServerCxn.Factory:0.0.0.0/0.0.0.0:0) [ ]
o.a.z.s.NIOServerCnxn Unable to read additional data from client sessionid
0x10978458c830020, likely client has closed socket
[junit4] 2> 4676441 INFO (closeThreadPool-7830-thread-1) [ ]
o.a.s.c.Overseer Overseer
(id=74723108933795870-127.0.0.1:37637_solr-n_0000000000) closing
[junit4] 2> 4676441 INFO
(OverseerStateUpdate-74723108933795870-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:37637_solr
[junit4] 2> 4676442 INFO
(OverseerAutoScalingTriggerThread-74723108933795870-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we
are closed, exiting.
[junit4] 2> 4676535 WARN (OverseerExitThread) [ ] o.a.s.c.Overseer
Error communicating with ZooKeeper
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /overseer_elect/leader
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1221)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getData$5(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.checkIfIamStillLeader(Overseer.java:319)
~[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4676763 INFO
(TEST-OverseerTest.testShardAssignment-seed#[C65F55BA4F749C69]) [ ]
o.a.s.SolrTestCaseJ4 ###Ending testShardAssignment
[junit4] 2> 4676770 INFO
(TEST-OverseerTest.testExternalClusterStateChangeBehavior-seed#[C65F55BA4F749C69])
[ ] o.a.s.SolrTestCaseJ4 ###Starting testExternalClusterStateChangeBehavior
[junit4] 2> 4676983 INFO (zkConnectionManagerCallback-7834-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4676994 INFO (zkConnectionManagerCallback-7840-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4676997 INFO (zkConnectionManagerCallback-7845-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 4677007 INFO
(TEST-OverseerTest.testExternalClusterStateChangeBehavior-seed#[C65F55BA4F749C69])
[ ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at
127.0.0.1:37637/solr ready
[junit4] 2> 4677008 INFO
(TEST-OverseerTest.testExternalClusterStateChangeBehavior-seed#[C65F55BA4F749C69])
[ ] o.a.s.c.OverseerElectionContext I am going to be the leader
127.0.0.1:37637_solr
[junit4] 2> 4677009 INFO
(TEST-OverseerTest.testExternalClusterStateChangeBehavior-seed#[C65F55BA4F749C69])
[ ] o.a.s.c.Overseer Overseer
(id=74723108933795874-127.0.0.1:37637_solr-n_0000000000) starting
[junit4] 2> 4677031 INFO
(OverseerStateUpdate-74723108933795874-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:37637_solr
[junit4] 2> 4677036 DEBUG
(OverseerAutoScalingTriggerThread-74723108933795874-127.0.0.1:37637_solr-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: []
[junit4] 2> 4677036 DEBUG (ScheduledTrigger-7888-thread-1) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 0 and last live nodes: 0
[junit4] 2> 4677165 INFO
(OverseerStateUpdate-74723108933795874-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.o.SliceMutator createReplica() {
[junit4] 2> "operation":"addreplica",
[junit4] 2> "collection":"test",
[junit4] 2> "shard":"x",
[junit4] 2> "base_url":"http://127.0.0.1/solr";,
[junit4] 2> "core_node_name":"core_node1",
[junit4] 2> "node_name":"node1",
[junit4] 2> "core":"core1",
[junit4] 2> "state":"down"}
[junit4] 2> 4677266 INFO (zkCallback-7658-thread-4) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeCreated path:/collections/test/state.json] for
collection [test] has occurred - updating... (live nodes size: [0])
[junit4] 2> 4677266 ERROR
(OverseerStateUpdate-74723108933795874-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Exception in Overseer main queue loop
[junit4] 2> org.apache.zookeeper.KeeperException$BadVersionException:
KeeperErrorCode = BadVersion for /clusterstate.json
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:118)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.setData(ZooKeeper.java:1336)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$setData$6(SolrZkClient.java:370)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.setData(SolrZkClient.java:370)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.overseer.ZkStateWriter.writePendingUpdates(ZkStateWriter.java:220)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.run(Overseer.java:247)
[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4677271 WARN
(OverseerStateUpdate-74723108933795874-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.o.ClusterStateMutator Collection test already exists. exit
[junit4] 2> 4677271 WARN
(OverseerStateUpdate-74723108933795874-127.0.0.1:37637_solr-n_0000000000) [
] o.a.s.c.Overseer Solr cannot talk to ZK, exiting Overseer work queue loop
[junit4] 2> org.apache.zookeeper.KeeperException$SessionExpiredException:
KeeperErrorCode = Session expired for /overseer/queue/qn-0000000004
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:130)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.KeeperException.create(KeeperException.java:54)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.zookeeper.ZooKeeper.getData(ZooKeeper.java:1221)
~[zookeeper-3.4.13.jar:3.4.13-2d71af4dbe22557fda74f9a9b4309b15a7487f03]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.lambda$getData$5(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.ZkCmdExecutor.retryOperation(ZkCmdExecutor.java:71)
~[java/:?]
[junit4] 2> at
org.apache.solr.common.cloud.SolrZkClient.getData(SolrZkClient.java:358)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.ZkDistributedQueue.removeFirst(ZkDistributedQueue.java:537)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.ZkDistributedQueue.poll(ZkDistributedQueue.java:211)
~[java/:?]
[junit4] 2> at
org.apache.solr.cloud.Overseer$ClusterStateUpdater.run(Overseer.java:185)
[java/:?]
[junit4] 2> at java.lang.Thread.run(Thread.java:748) [?:1.8.0_191]
[junit4] 2> 4677271 INFO
(OverseerStateUpdate-74723108933795874-127.0.0.1:37637_solr-n_0000000000) [
[...truncated too long message...]
urce] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
ivy-availability-check:
[loadresource] Do not set property disallowed.ivy.jars.list as its length is 0.
-ivy-fail-disallowed-ivy-version:
ivy-fail:
ivy-fail:
ivy-configure:
[ivy:configure] :: loading settings :: file =
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/lucene/top-level-ivy-settings.xml
resolve:
jar-checksums:
[mkdir] Created dir:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/solr/null214645166
[copy] Copying 242 files to
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/solr/null214645166
[delete] Deleting directory
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.7/checkout/solr/null214645166
check-working-copy:
[ivy:cachepath] :: resolving dependencies ::
org.eclipse.jgit#org.eclipse.jgit-caller;working
[ivy:cachepath] confs: [default]
[ivy:cachepath] found
org.eclipse.jgit#org.eclipse.jgit;4.6.0.201612231935-r in public
[ivy:cachepath] found com.jcraft#jsch;0.1.53 in public
[ivy:cachepath] found com.googlecode.javaewah#JavaEWAH;1.1.6 in public
[ivy:cachepath] found org.apache.httpcomponents#httpclient;4.3.6 in
public
[ivy:cachepath] found org.apache.httpcomponents#httpcore;4.3.3 in public
[ivy:cachepath] found commons-logging#commons-logging;1.1.3 in public
[ivy:cachepath] found commons-codec#commons-codec;1.6 in public
[ivy:cachepath] found org.slf4j#slf4j-api;1.7.2 in public
[ivy:cachepath] :: resolution report :: resolve 103ms :: artifacts dl 35ms
---------------------------------------------------------------------
| | modules || artifacts |
| conf | number| search|dwnlded|evicted|| number|dwnlded|
---------------------------------------------------------------------
| default | 8 | 0 | 0 | 0 || 8 | 0 |
---------------------------------------------------------------------
[wc-checker] Initializing working copy...
[wc-checker] SLF4J: Failed to load class "org.slf4j.impl.StaticLoggerBinder".
[wc-checker] SLF4J: Defaulting to no-operation (NOP) logger implementation
[wc-checker] SLF4J: See http://www.slf4j.org/codes.html#StaticLoggerBinder for
further details.
[wc-checker] Checking working copy status...
-jenkins-base:
BUILD SUCCESSFUL
Total time: 470 minutes 42 seconds
Archiving artifacts
java.lang.InterruptedException: no matches found within 10000
at hudson.FilePath$ValidateAntFileMask.hasMatch(FilePath.java:2847)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2726)
at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2707)
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3086)
Also: hudson.remoting.Channel$CallSiteStackTrace: Remote call to lucene2
at
hudson.remoting.Channel.attachCallSiteStackTrace(Channel.java:1741)
at
hudson.remoting.UserRequest$ExceptionResponse.retrieve(UserRequest.java:357)
at hudson.remoting.Channel.call(Channel.java:955)
at hudson.FilePath.act(FilePath.java:1072)
at hudson.FilePath.act(FilePath.java:1061)
at hudson.FilePath.validateAntFileMask(FilePath.java:2705)
at
hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:243)
at
hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:81)
at
hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at
hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:744)
at
hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:690)
at hudson.model.Build$BuildExecution.post2(Build.java:186)
at
hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:635)
at hudson.model.Run.execute(Run.java:1835)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at
hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
Caused: hudson.FilePath$TunneledInterruptedException
at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3088)
at hudson.remoting.UserRequest.perform(UserRequest.java:212)
at hudson.remoting.UserRequest.perform(UserRequest.java:54)
at hudson.remoting.Request$2.run(Request.java:369)
at
hudson.remoting.InterceptingExecutorService$1.call(InterceptingExecutorService.java:72)
at java.util.concurrent.FutureTask.run(FutureTask.java:266)
at
java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1142)
at
java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:617)
at java.lang.Thread.run(Thread.java:748)
Caused: java.lang.InterruptedException: java.lang.InterruptedException: no
matches found within 10000
at hudson.FilePath.act(FilePath.java:1074)
at hudson.FilePath.act(FilePath.java:1061)
at hudson.FilePath.validateAntFileMask(FilePath.java:2705)
at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:243)
at
hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:81)
at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
at
hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:744)
at
hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:690)
at hudson.model.Build$BuildExecution.post2(Build.java:186)
at
hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:635)
at hudson.model.Run.execute(Run.java:1835)
at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
at hudson.model.ResourceController.execute(ResourceController.java:97)
at hudson.model.Executor.run(Executor.java:429)
No artifacts found that match the file pattern
"**/*.events,heapdumps/**,**/hs_err_pid*". Configuration error?
Recording test results
Build step 'Publish JUnit test result report' changed build result to UNSTABLE
Email was triggered for: Unstable (Test Failures)
Sending email for trigger: Unstable (Test Failures)
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]
