You are viewing a plain text version of this content. The canonical link for it is here.
Posted to dev@lucene.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2016/03/18 11:19:34 UTC
[JENKINS] Lucene-Solr-Tests-6.x - Build # 73 - Failure
Build: https://builds.apache.org/job/Lucene-Solr-Tests-6.x/73/
1 tests failed.
FAILED: org.apache.solr.cloud.overseer.ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy
Error Message:
Could not find collection : c1
Stack Trace:
org.apache.solr.common.SolrException: Could not find collection : c1
at __randomizedtesting.SeedInfo.seed([C008007DF3246859:AB47A0008A2BB563]:0)
at org.apache.solr.common.cloud.ClusterState.getCollection(ClusterState.java:170)
at org.apache.solr.cloud.overseer.ZkStateReaderTest.testStateFormatUpdate(ZkStateReaderTest.java:135)
at org.apache.solr.cloud.overseer.ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy(ZkStateReaderTest.java:46)
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:497)
at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1764)
at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:871)
at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:907)
at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:921)
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:367)
at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:809)
at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:460)
at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:880)
at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:781)
at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:816)
at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:827)
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:367)
at java.lang.Thread.run(Thread.java:745)
Build Log:
[...truncated 12078 lines...]
[junit4] Suite: org.apache.solr.cloud.overseer.ZkStateReaderTest
[junit4] 2> Creating dataDir: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J2/temp/solr.cloud.overseer.ZkStateReaderTest_C008007DF3246859-001/init-core-data-001
[junit4] 2> 1822779 INFO (SUITE-ZkStateReaderTest-seed#[C008007DF3246859]-worker) [ ] o.a.s.SolrTestCaseJ4 Randomized ssl (true) and clientAuth (false)
[junit4] 2> 1822782 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testStateFormatUpdateWithExplicitRefreshLazy
[junit4] 2> 1822782 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 1822782 INFO (Thread-5273) [ ] o.a.s.c.ZkTestServer client port:0.0.0.0/0.0.0.0:0
[junit4] 2> 1822782 INFO (Thread-5273) [ ] o.a.s.c.ZkTestServer Starting server
[junit4] 2> 1822882 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer start zk server on port:36810
[junit4] 2> 1822883 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1822884 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1822886 INFO (zkCallback-2238-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@39578098 name:ZooKeeperConnection Watcher:127.0.0.1:36810 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1822886 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1822886 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1822889 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1822899 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1822902 INFO (zkCallback-2239-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@7c87ecf6 name:ZooKeeperConnection Watcher:127.0.0.1:36810 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1822902 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1822902 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1822903 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /solr
[junit4] 2> 1822907 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1822908 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1822911 INFO (zkCallback-2240-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@6f186258 name:ZooKeeperConnection Watcher:127.0.0.1:36810/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1822911 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1822911 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1822912 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /live_nodes
[junit4] 2> 1822913 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections
[junit4] 2> 1822914 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /aliases.json
[junit4] 2> 1822915 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /clusterstate.json
[junit4] 2> 1822918 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /security.json
[junit4] 2> 1822919 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updating cluster state from ZooKeeper...
[junit4] 2> 1822920 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (0)
[junit4] 2> 1822921 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections/c1
[junit4] 2> 1822923 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.o.ZkStateWriter going to create_collection /collections/c1/state.json
[junit4] 2> 1822925 INFO (zkCallback-2240-thread-1) [ ] o.a.s.c.c.ZkStateReader A collections change: [WatchedEvent state:SyncConnected type:NodeChildrenChanged path:/collections], has occurred - updating...
[junit4] 2> 1822925 WARN (zkCallback-2240-thread-1) [ ] o.a.s.c.c.ZkStateReader ZooKeeper watch triggered, but Solr cannot talk to ZK: [KeeperErrorCode = Session expired for /collections]
[junit4] 2> 1822926 INFO (zkCallback-2240-thread-2) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json], has occurred - updating... (live nodes size: [0])
[junit4] 2> 1822926 WARN (zkCallback-2240-thread-2) [ ] o.a.s.c.c.ZkStateReader ZooKeeper watch triggered, but Solr cannot talk to ZK: [KeeperErrorCode = Session expired for /clusterstate.json]
[junit4] 2> 1822928 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:36810 36810
[junit4] 2> 1823145 INFO (Thread-5273) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:36810 36810
[junit4] 2> 1823147 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testStateFormatUpdateWithExplicitRefreshLazy
[junit4] 2> NOTE: reproduce with: ant test -Dtestcase=ZkStateReaderTest -Dtests.method=testStateFormatUpdateWithExplicitRefreshLazy -Dtests.seed=C008007DF3246859 -Dtests.multiplier=2 -Dtests.slow=true -Dtests.locale=en-MT -Dtests.timezone=US/Central -Dtests.asserts=true -Dtests.file.encoding=UTF-8
[junit4] ERROR 0.37s J2 | ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy <<<
[junit4] > Throwable #1: org.apache.solr.common.SolrException: Could not find collection : c1
[junit4] > at __randomizedtesting.SeedInfo.seed([C008007DF3246859:AB47A0008A2BB563]:0)
[junit4] > at org.apache.solr.common.cloud.ClusterState.getCollection(ClusterState.java:170)
[junit4] > at org.apache.solr.cloud.overseer.ZkStateReaderTest.testStateFormatUpdate(ZkStateReaderTest.java:135)
[junit4] > at org.apache.solr.cloud.overseer.ZkStateReaderTest.testStateFormatUpdateWithExplicitRefreshLazy(ZkStateReaderTest.java:46)
[junit4] > at java.lang.Thread.run(Thread.java:745)
[junit4] 2> 1823152 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testStateFormatUpdateWithExplicitRefresh
[junit4] 2> 1823152 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 1823152 INFO (Thread-5274) [ ] o.a.s.c.ZkTestServer client port:0.0.0.0/0.0.0.0:0
[junit4] 2> 1823152 INFO (Thread-5274) [ ] o.a.s.c.ZkTestServer Starting server
[junit4] 2> 1823252 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer start zk server on port:39068
[junit4] 2> 1823253 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1823253 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1823255 INFO (zkCallback-2241-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@10486e25 name:ZooKeeperConnection Watcher:127.0.0.1:39068 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1823255 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1823256 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1823259 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1823259 WARN (NIOServerCxn.Factory:0.0.0.0/0.0.0.0:0) [ ] o.a.z.s.NIOServerCnxn caught end of stream exception
[junit4] 2> EndOfStreamException: Unable to read additional data from client sessionid 0x1538935af2e0000, likely client has closed socket
[junit4] 2> at org.apache.zookeeper.server.NIOServerCnxn.doIO(NIOServerCnxn.java:228)
[junit4] 2> at org.apache.zookeeper.server.NIOServerCnxnFactory.run(NIOServerCnxnFactory.java:208)
[junit4] 2> at java.lang.Thread.run(Thread.java:745)
[junit4] 2> 1823260 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1823261 INFO (zkCallback-2242-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@f48aef4 name:ZooKeeperConnection Watcher:127.0.0.1:39068 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1823261 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1823262 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1823262 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /solr
[junit4] 2> 1823265 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1823265 WARN (NIOServerCxn.Factory:0.0.0.0/0.0.0.0:0) [ ] o.a.z.s.NIOServerCnxn caught end of stream exception
[junit4] 2> EndOfStreamException: Unable to read additional data from client sessionid 0x1538935af2e0001, likely client has closed socket
[junit4] 2> at org.apache.zookeeper.server.NIOServerCnxn.doIO(NIOServerCnxn.java:228)
[junit4] 2> at org.apache.zookeeper.server.NIOServerCnxnFactory.run(NIOServerCnxnFactory.java:208)
[junit4] 2> at java.lang.Thread.run(Thread.java:745)
[junit4] 2> 1823265 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1823266 INFO (zkCallback-2243-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@38b18579 name:ZooKeeperConnection Watcher:127.0.0.1:39068/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1823267 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1823267 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1823269 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /live_nodes
[junit4] 2> 1823271 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections
[junit4] 2> 1823272 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /aliases.json
[junit4] 2> 1823273 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /clusterstate.json
[junit4] 2> 1823274 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /security.json
[junit4] 2> 1823275 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updating cluster state from ZooKeeper...
[junit4] 2> 1823276 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (0)
[junit4] 2> 1823277 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader addZkWatch [c1]
[junit4] 2> 1823277 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Deleting data for [c1]
[junit4] 2> 1823278 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Deleting data for [c1]
[junit4] 2> 1823278 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections/c1
[junit4] 2> 1823279 INFO (zkCallback-2243-thread-1) [ ] o.a.s.c.c.ZkStateReader A collections change: [WatchedEvent state:SyncConnected type:NodeChildrenChanged path:/collections], has occurred - updating...
[junit4] 2> 1823280 INFO (zkCallback-2243-thread-1) [ ] o.a.s.c.c.ZkStateReader Deleting data for [c1]
[junit4] 2> 1823280 INFO (zkCallback-2243-thread-2) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json], has occurred - updating... (live nodes size: [0])
[junit4] 2> 1823281 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.o.ZkStateWriter going to create_collection /collections/c1/state.json
[junit4] 2> 1823282 INFO (zkCallback-2243-thread-2) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json], has occurred - updating... (live nodes size: [0])
[junit4] 2> 1823283 INFO (zkCallback-2243-thread-2) [ ] o.a.s.c.c.ZkStateReader Add data for [c1] ver [0]
[junit4] 2> 1823286 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:39068 39068
[junit4] 2> 1823496 INFO (Thread-5274) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:39068 39068
[junit4] 2> 1823499 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithExplicitRefresh-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testStateFormatUpdateWithExplicitRefresh
[junit4] 2> 1823504 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testExternalCollectionWatchedNotWatched
[junit4] 2> 1823504 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 1823504 INFO (Thread-5275) [ ] o.a.s.c.ZkTestServer client port:0.0.0.0/0.0.0.0:0
[junit4] 2> 1823504 INFO (Thread-5275) [ ] o.a.s.c.ZkTestServer Starting server
[junit4] 2> 1823604 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer start zk server on port:47857
[junit4] 2> 1823605 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1823605 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1823608 INFO (zkCallback-2244-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@4e7ed9b8 name:ZooKeeperConnection Watcher:127.0.0.1:47857 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1823608 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1823608 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1823615 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1823616 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1823617 INFO (zkCallback-2245-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@24578401 name:ZooKeeperConnection Watcher:127.0.0.1:47857 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1823617 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1823617 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1823617 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /solr
[junit4] 2> 1823619 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1823622 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1823623 INFO (zkCallback-2246-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@206ac97e name:ZooKeeperConnection Watcher:127.0.0.1:47857/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1823623 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1823623 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1823624 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /live_nodes
[junit4] 2> 1823625 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections
[junit4] 2> 1823626 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /aliases.json
[junit4] 2> 1823627 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /clusterstate.json
[junit4] 2> 1823628 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /security.json
[junit4] 2> 1823629 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updating cluster state from ZooKeeper...
[junit4] 2> 1823630 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (0)
[junit4] 2> 1823630 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections/c1
[junit4] 2> 1823631 INFO (zkCallback-2246-thread-1) [ ] o.a.s.c.c.ZkStateReader A collections change: [WatchedEvent state:SyncConnected type:NodeChildrenChanged path:/collections], has occurred - updating...
[junit4] 2> 1823631 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.o.ZkStateWriter going to create_collection /collections/c1/state.json
[junit4] 2> 1823632 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader addZkWatch [c1]
[junit4] 2> 1823633 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Add data for [c1] ver [0]
[junit4] 2> 1823633 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Removing watch for uninteresting collection [c1]
[junit4] 2> 1823634 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:47857 47857
[junit4] 2> 1823773 INFO (Thread-5275) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:47857 47857
[junit4] 2> 1823775 INFO (TEST-ZkStateReaderTest.testExternalCollectionWatchedNotWatched-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testExternalCollectionWatchedNotWatched
[junit4] 2> 1823780 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testStateFormatUpdateWithTimeDelayLazy
[junit4] 2> 1823781 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 1823781 INFO (Thread-5276) [ ] o.a.s.c.ZkTestServer client port:0.0.0.0/0.0.0.0:0
[junit4] 2> 1823781 INFO (Thread-5276) [ ] o.a.s.c.ZkTestServer Starting server
[junit4] 2> 1823881 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer start zk server on port:48670
[junit4] 2> 1823881 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1823882 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1823885 INFO (zkCallback-2247-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@4ab3190c name:ZooKeeperConnection Watcher:127.0.0.1:48670 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1823885 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1823886 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1823887 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1823887 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1823888 INFO (zkCallback-2248-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@4338e7fe name:ZooKeeperConnection Watcher:127.0.0.1:48670 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1823888 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1823889 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1823889 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /solr
[junit4] 2> 1823892 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1823893 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1823896 INFO (zkCallback-2249-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@1ea808cf name:ZooKeeperConnection Watcher:127.0.0.1:48670/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1823896 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1823896 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1823897 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /live_nodes
[junit4] 2> 1823899 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections
[junit4] 2> 1823900 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /aliases.json
[junit4] 2> 1823901 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /clusterstate.json
[junit4] 2> 1823902 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /security.json
[junit4] 2> 1823904 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updating cluster state from ZooKeeper...
[junit4] 2> 1823905 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (0)
[junit4] 2> 1823905 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections/c1
[junit4] 2> 1823907 INFO (zkCallback-2249-thread-1) [ ] o.a.s.c.c.ZkStateReader A collections change: [WatchedEvent state:SyncConnected type:NodeChildrenChanged path:/collections], has occurred - updating...
[junit4] 2> 1823908 INFO (zkCallback-2249-thread-1) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json], has occurred - updating... (live nodes size: [0])
[junit4] 2> 1823910 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.o.ZkStateWriter going to create_collection /collections/c1/state.json
[junit4] 2> 1823911 INFO (zkCallback-2249-thread-1) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json], has occurred - updating... (live nodes size: [0])
[junit4] 2> 1823964 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:48670 48670
[junit4] 2> 1824169 INFO (Thread-5276) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:48670 48670
[junit4] 2> 1824171 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelayLazy-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testStateFormatUpdateWithTimeDelayLazy
[junit4] 2> 1824174 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testStateFormatUpdateWithTimeDelay
[junit4] 2> 1824175 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 1824175 INFO (Thread-5277) [ ] o.a.s.c.ZkTestServer client port:0.0.0.0/0.0.0.0:0
[junit4] 2> 1824175 INFO (Thread-5277) [ ] o.a.s.c.ZkTestServer Starting server
[junit4] 2> 1824275 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer start zk server on port:37528
[junit4] 2> 1824275 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1824276 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1824278 INFO (zkCallback-2250-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@30751f40 name:ZooKeeperConnection Watcher:127.0.0.1:37528 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1824279 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1824279 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1824280 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1824281 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1824281 INFO (zkCallback-2251-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@f35a020 name:ZooKeeperConnection Watcher:127.0.0.1:37528 got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1824281 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1824282 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1824282 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /solr
[junit4] 2> 1824285 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkCredentialsProvider
[junit4] 2> 1824286 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1824286 INFO (zkCallback-2252-thread-1) [ ] o.a.s.c.c.ConnectionManager Watcher org.apache.solr.common.cloud.ConnectionManager@2313b58b name:ZooKeeperConnection Watcher:127.0.0.1:37528/solr got event WatchedEvent state:SyncConnected type:None path:null path:null type:None
[junit4] 2> 1824286 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1824287 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient Using default ZkACLProvider
[junit4] 2> 1824287 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /live_nodes
[junit4] 2> 1824289 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections
[junit4] 2> 1824290 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /aliases.json
[junit4] 2> 1824291 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /clusterstate.json
[junit4] 2> 1824292 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /security.json
[junit4] 2> 1824293 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updating cluster state from ZooKeeper...
[junit4] 2> 1824295 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (0)
[junit4] 2> 1824295 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader addZkWatch [c1]
[junit4] 2> 1824296 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Deleting data for [c1]
[junit4] 2> 1824296 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.ZkStateReader Deleting data for [c1]
[junit4] 2> 1824296 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.c.SolrZkClient makePath: /collections/c1
[junit4] 2> 1824298 INFO (zkCallback-2252-thread-1) [ ] o.a.s.c.c.ZkStateReader A collections change: [WatchedEvent state:SyncConnected type:NodeChildrenChanged path:/collections], has occurred - updating...
[junit4] 2> 1824299 INFO (zkCallback-2252-thread-1) [ ] o.a.s.c.c.ZkStateReader Deleting data for [c1]
[junit4] 2> 1824299 INFO (zkCallback-2252-thread-2) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json], has occurred - updating... (live nodes size: [0])
[junit4] 2> 1824350 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.o.ZkStateWriter going to create_collection /collections/c1/state.json
[junit4] 2> 1824351 INFO (zkCallback-2252-thread-2) [ ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/clusterstate.json], has occurred - updating... (live nodes size: [0])
[junit4] 2> 1824352 INFO (zkCallback-2252-thread-2) [ ] o.a.s.c.c.ZkStateReader Add data for [c1] ver [0]
[junit4] 2> 1824404 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:37528 37528
[junit4] 2> 1824827 INFO (Thread-5277) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:37528 37528
[junit4] 2> 1824828 INFO (TEST-ZkStateReaderTest.testStateFormatUpdateWithTimeDelay-seed#[C008007DF3246859]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testStateFormatUpdateWithTimeDelay
[junit4] 2> 1824829 INFO (SUITE-ZkStateReaderTest-seed#[C008007DF3246859]-worker) [ ] o.a.s.SolrTestCaseJ4 ###deleteCore
[junit4] 2> NOTE: leaving temporary files on disk at: /x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build/solr-core/test/J2/temp/solr.cloud.overseer.ZkStateReaderTest_C008007DF3246859-001
[junit4] 2> Mar 18, 2016 10:11:51 AM com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
[junit4] 2> WARNING: Will linger awaiting termination of 1 leaked thread(s).
[junit4] 2> NOTE: test params are: codec=Asserting(Lucene60): {}, docValues:{}, maxPointsInLeafNode=172, maxMBSortInHeap=4.413606692419549, sim=RandomSimilarity(queryNorm=false,coord=no): {}, locale=en-MT, timezone=US/Central
[junit4] 2> NOTE: Linux 3.13.0-52-generic amd64/Oracle Corporation 1.8.0_66 (64-bit)/cpus=4,threads=1,free=206204872,total=523763712
[junit4] 2> NOTE: All tests run in this JVM: [TestZkChroot, TestJettySolrRunner, SuggesterTest, TestSolrDeletionPolicy1, OverseerTaskQueueTest, TestPHPSerializedResponseWriter, TestFieldResource, TestDistributedMissingSort, TestUtils, HdfsDirectoryTest, TestReqParamsAPI, TestPerFieldSimilarity, PluginInfoTest, ReplicationFactorTest, BaseCdcrDistributedZkTest, StressHdfsTest, TestSolrQueryParser, PrimitiveFieldTypeTest, RulesTest, HdfsNNFailoverTest, VersionInfoTest, MultiThreadedOCPTest, TestIndexSearcher, LeaderElectionTest, TestElisionMultitermQuery, IgnoreCommitOptimizeUpdateProcessorFactoryTest, TestReversedWildcardFilterFactory, TestCollationField, TestDocBasedVersionConstraints, CircularListTest, TestMacros, BadComponentTest, BitVectorTest, XmlUpdateRequestHandlerTest, TestSolrQueryParserResource, TestRebalanceLeaders, FacetPivotSmallTest, TestSolrJ, DirectSolrConnectionTest, HdfsChaosMonkeyNothingIsSafeTest, TestLeaderInitiatedRecoveryThread, TestExtendedDismaxParser, TestJmxMonitoredMap, OverseerCollectionConfigSetProcessorTest, SolrTestCaseJ4Test, TestConfigOverlay, DateMathParserTest, CollectionStateFormat2Test, QueryParsingTest, SharedFSAutoReplicaFailoverTest, HardAutoCommitTest, TestXIncludeConfig, RegexBoostProcessorTest, TestSuggestSpellingConverter, StatelessScriptUpdateProcessorFactoryTest, TestTolerantSearch, VMParamsZkACLAndCredentialsProvidersTest, ConnectionManagerTest, TestSolrCloudWithKerberosAlt, TestWriterPerf, TestSchemaNameResource, TestCoreDiscovery, TestRuleBasedAuthorizationPlugin, AssignTest, TestDownShardTolerantSearch, TestFastWriter, ScriptEngineTest, HighlighterMaxOffsetTest, TestJsonRequest, OverseerTest, TestSolrConfigHandlerCloud, TestManagedResourceStorage, TestGroupingSearch, TestJmxIntegration, TestCharFilters, HdfsTlogReplayBufferedWhileIndexingTest, TestSolrQueryResponse, TestConfigSets, DeleteLastCustomShardedReplicaTest, TestSimpleQParserPlugin, UpdateParamsTest, TestManagedSchema, TestDynamicFieldCollectionResource, NoCacheHeaderTest, BlockCacheTest, CurrencyFieldXmlFileTest, TestManagedSynonymFilterFactory, TestFileDictionaryLookup, TestNamedUpdateProcessors, TestSearchPerf, AnalysisErrorHandlingTest, SyncSliceTest, TestReplicationHandler, TestFaceting, TestRecovery, DistributedSpellCheckComponentTest, TermVectorComponentDistributedTest, TestStressReorder, TestJoin, StatsComponentTest, TestFiltering, AnalysisAfterCoreReloadTest, SolrRequestParserTest, TestTrie, PolyFieldTest, TestAtomicUpdateErrorCases, DocValuesMultiTest, XsltUpdateRequestHandlerTest, LukeRequestHandlerTest, RequestHandlersTest, MoreLikeThisHandlerTest, LoggingHandlerTest, UpdateRequestProcessorFactoryTest, MBeansHandlerTest, BinaryUpdateRequestHandlerTest, TestLFUCache, AsyncCallRequestStatusResponseTest, CdcrReplicationHandlerTest, CdcrRequestHandlerTest, CdcrVersionReplicationTest, DeleteInactiveReplicaTest, DeleteReplicaTest, DistribJoinFromCollectionTest, ForceLeaderTest, OutOfBoxZkACLAndCredentialsProvidersTest, OverriddenZkACLAndCredentialsProvidersTest, SSLMigrationTest, SaslZkACLProviderTest, ShardSplitTest, TestMiniSolrCloudClusterSSL, TestRequestStatusCollectionAPI, TestShortCircuitedRequests, TestSizeLimitedDistributedMap, HdfsRestartWhileUpdatingTest, TestClusterStateMutator, ZkStateReaderTest]
[junit4] Completed [470/581 (1!)] on J2 in 2.32s, 5 tests, 1 error <<< FAILURES!
[...truncated 377 lines...]
BUILD FAILED
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/build.xml:740: The following error occurred while executing this line:
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/build.xml:684: The following error occurred while executing this line:
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/build.xml:59: The following error occurred while executing this line:
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/build.xml:233: The following error occurred while executing this line:
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/solr/common-build.xml:526: The following error occurred while executing this line:
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/lucene/common-build.xml:1457: The following error occurred while executing this line:
/x1/jenkins/jenkins-slave/workspace/Lucene-Solr-Tests-6.x/lucene/common-build.xml:1014: There were test failures: 581 suites (10 ignored), 2327 tests, 1 error, 86 ignored (70 assumptions) [seed: C008007DF3246859]
Total time: 61 minutes 51 seconds
Build step 'Invoke Ant' marked build as failure
Archiving artifacts
Recording test results
Email was triggered for: Failure - Any
Sending email for trigger: Failure - Any