Build: https://jenkins.thetaphi.de/job/Lucene-Solr-7.x-Solaris/641/ Java: 64bit/jdk1.8.0 -XX:+UseCompressedOops -XX:+UseParallelGC
1 tests failed. FAILED: org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest.testRestoreState Error Message: Did not expect the processor to fire on first run! event={ "id":"82f3c263a97d0Tem0lr4npep3x95anmd5gaq9q", "source":"node_added_trigger", "eventTime":2303735199602640, "eventType":"NODEADDED", "properties":{ "eventTimes":[ 2303735199602640, 2303735199604860, 2303735199606508, 2303735199607995], "nodeNames":[ "127.0.0.1:61925_solr", "127.0.0.1:44485_solr", "127.0.0.1:53948_solr", "127.0.0.1:46194_solr"]}} Stack Trace: java.lang.AssertionError: Did not expect the processor to fire on first run! event={ "id":"82f3c263a97d0Tem0lr4npep3x95anmd5gaq9q", "source":"node_added_trigger", "eventTime":2303735199602640, "eventType":"NODEADDED", "properties":{ "eventTimes":[ 2303735199602640, 2303735199604860, 2303735199606508, 2303735199607995], "nodeNames":[ "127.0.0.1:61925_solr", "127.0.0.1:44485_solr", "127.0.0.1:53948_solr", "127.0.0.1:46194_solr"]}} at __randomizedtesting.SeedInfo.seed([BA3D4752AB1F3B9A:7493E3C15326438C]:0) at org.junit.Assert.fail(Assert.java:93) at org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest.lambda$new$0(NodeAddedTriggerTest.java:49) at org.apache.solr.cloud.autoscaling.NodeAddedTrigger.run(NodeAddedTrigger.java:161) at org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest.testRestoreState(NodeAddedTriggerTest.java:257) 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:1737) at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:934) at com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:970) at com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:984) 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:943) at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829) at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879) at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890) 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 12889 lines...] [junit4] Suite: org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest [junit4] 2> Creating dataDir: /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.NodeAddedTriggerTest_BA3D4752AB1F3B9A-001/init-core-data-001 [junit4] 2> 785225 INFO (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.s.SolrTestCaseJ4 Using TrieFields (NUMERIC_POINTS_SYSPROP=false) w/NUMERIC_DOCVALUES_SYSPROP=false [junit4] 2> 785227 INFO (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (false) via: @org.apache.solr.util.RandomizeSSL(reason=, value=NaN, ssl=NaN, clientAuth=NaN) [junit4] 2> 785227 INFO (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom [junit4] 2> 785227 INFO (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.s.c.MiniSolrCloudCluster Starting cluster of 1 servers in /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.NodeAddedTriggerTest_BA3D4752AB1F3B9A-001/tempDir-001 [junit4] 2> 785227 INFO (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER [junit4] 2> 785228 INFO (Thread-837) [ ] o.a.s.c.ZkTestServer client port:0.0.0.0/0.0.0.0:0 [junit4] 2> 785228 INFO (Thread-837) [ ] o.a.s.c.ZkTestServer Starting server [junit4] 2> 785237 ERROR (Thread-837) [ ] o.a.z.s.ZooKeeperServer ZKShutdownHandler is not registered, so ZooKeeper server won't take any action on ERROR or SHUTDOWN server state changes [junit4] 2> 785328 INFO (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.s.c.ZkTestServer start zk server on port:38179 [junit4] 2> 785332 INFO (zkConnectionManagerCallback-1378-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 785340 INFO (jetty-launcher-1375-thread-1) [ ] o.e.j.s.Server jetty-9.4.10.v20180503; built: 2018-05-03T15:56:21.710Z; git: daa59876e6f384329b122929e70a80934569428c; jvm 1.8.0_172-b11 [junit4] 2> 785341 INFO (jetty-launcher-1375-thread-1) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 785341 INFO (jetty-launcher-1375-thread-1) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 785341 INFO (jetty-launcher-1375-thread-1) [ ] o.e.j.s.session node0 Scavenging every 660000ms [junit4] 2> 785342 INFO (jetty-launcher-1375-thread-1) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@1d2dfd90{/solr,null,AVAILABLE} [junit4] 2> 785351 INFO (jetty-launcher-1375-thread-1) [ ] o.e.j.s.AbstractConnector Started ServerConnector@4de5e007{HTTP/1.1,[http/1.1]}{127.0.0.1:61925} [junit4] 2> 785351 INFO (jetty-launcher-1375-thread-1) [ ] o.e.j.s.Server Started @785806ms [junit4] 2> 785351 INFO (jetty-launcher-1375-thread-1) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, hostPort=61925} [junit4] 2> 785352 ERROR (jetty-launcher-1375-thread-1) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 785352 INFO (jetty-launcher-1375-thread-1) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 785352 INFO (jetty-launcher-1375-thread-1) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version 7.4.0 [junit4] 2> 785352 INFO (jetty-launcher-1375-thread-1) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null [junit4] 2> 785352 INFO (jetty-launcher-1375-thread-1) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null [junit4] 2> 785352 INFO (jetty-launcher-1375-thread-1) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2018-05-23T00:55:09.243Z [junit4] 2> 785355 INFO (zkConnectionManagerCallback-1380-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 785356 INFO (jetty-launcher-1375-thread-1) [ ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading... [junit4] 2> 785376 INFO (jetty-launcher-1375-thread-1) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38179/solr [junit4] 2> 785380 INFO (zkConnectionManagerCallback-1384-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 785385 INFO (zkConnectionManagerCallback-1386-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 785737 INFO (jetty-launcher-1375-thread-1) [n:127.0.0.1:61925_solr ] o.a.s.c.Overseer Overseer (id=null) closing [junit4] 2> 785739 INFO (jetty-launcher-1375-thread-1) [n:127.0.0.1:61925_solr ] o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:61925_solr [junit4] 2> 785741 INFO (jetty-launcher-1375-thread-1) [n:127.0.0.1:61925_solr ] o.a.s.c.Overseer Overseer (id=72208570448216067-127.0.0.1:61925_solr-n_0000000000) starting [junit4] 2> 785811 INFO (zkConnectionManagerCallback-1393-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 785817 INFO (jetty-launcher-1375-thread-1) [n:127.0.0.1:61925_solr ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38179/solr ready [junit4] 2> 785820 INFO (jetty-launcher-1375-thread-1) [n:127.0.0.1:61925_solr ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:61925_solr [junit4] 2> 785900 INFO (zkCallback-1385-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1) [junit4] 2> 785926 INFO (zkCallback-1392-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1) [junit4] 2> 786923 INFO (jetty-launcher-1375-thread-1) [n:127.0.0.1:61925_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_61925.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 786981 INFO (jetty-launcher-1375-thread-1) [n:127.0.0.1:61925_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_61925.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 786981 INFO (jetty-launcher-1375-thread-1) [n:127.0.0.1:61925_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_61925.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 786985 INFO (jetty-launcher-1375-thread-1) [n:127.0.0.1:61925_solr ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.NodeAddedTriggerTest_BA3D4752AB1F3B9A-001/tempDir-001/node1/. [junit4] 2> 787057 INFO (zkConnectionManagerCallback-1395-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 787060 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 0x100894fef4e0005, likely client has closed socket [junit4] 2> 787070 INFO (zkConnectionManagerCallback-1400-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 787074 INFO (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1) [junit4] 2> 787076 INFO (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38179/solr ready [junit4] 2> 787178 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testListenerAcceptance [junit4] 2> 787200 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server jetty-9.4.10.v20180503; built: 2018-05-03T15:56:21.710Z; git: daa59876e6f384329b122929e70a80934569428c; jvm 1.8.0_172-b11 [junit4] 2> 787202 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 787202 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 787202 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session node0 Scavenging every 600000ms [junit4] 2> 787202 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@4a19f21e{/solr,null,AVAILABLE} [junit4] 2> 787203 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@f4d8229{HTTP/1.1,[http/1.1]}{127.0.0.1:44485} [junit4] 2> 787203 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server Started @787659ms [junit4] 2> 787203 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, hostPort=44485} [junit4] 2> 787203 ERROR (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 787210 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 787210 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version 7.4.0 [junit4] 2> 787210 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null [junit4] 2> 787210 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null [junit4] 2> 787210 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2018-05-23T00:55:11.101Z [junit4] 2> 787213 INFO (zkConnectionManagerCallback-1402-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 787215 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading... [junit4] 2> 787243 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38179/solr [junit4] 2> 787246 INFO (zkConnectionManagerCallback-1406-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 787252 INFO (zkConnectionManagerCallback-1408-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 787301 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1) [junit4] 2> 787317 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.c.Overseer Overseer (id=null) closing [junit4] 2> 787346 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores [junit4] 2> 787346 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:44485_solr [junit4] 2> 787366 INFO (zkCallback-1392-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2) [junit4] 2> 787400 INFO (zkCallback-1399-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2) [junit4] 2> 787400 INFO (zkCallback-1407-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2) [junit4] 2> 787400 INFO (zkCallback-1385-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2) [junit4] 2> 789302 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_44485.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 789323 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_44485.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 789323 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_44485.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 789325 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.NodeAddedTriggerTest_BA3D4752AB1F3B9A-001/tempDir-001/node2/. [junit4] 2> 789353 INFO (zkConnectionManagerCallback-1415-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 789355 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2) [junit4] 2> 789372 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:44485_solr ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38179/solr ready [junit4] 2> 789421 INFO (TEST-NodeAddedTriggerTest.testListenerAcceptance-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testListenerAcceptance [junit4] 2> 789473 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testTrigger [junit4] 2> 789475 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server jetty-9.4.10.v20180503; built: 2018-05-03T15:56:21.710Z; git: daa59876e6f384329b122929e70a80934569428c; jvm 1.8.0_172-b11 [junit4] 2> 789476 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 789476 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 789476 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session node0 Scavenging every 600000ms [junit4] 2> 789478 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@7b63927e{/solr,null,AVAILABLE} [junit4] 2> 789480 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@110ce546{HTTP/1.1,[http/1.1]}{127.0.0.1:46194} [junit4] 2> 789480 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server Started @789937ms [junit4] 2> 789480 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, hostPort=46194} [junit4] 2> 789480 ERROR (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 789529 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 789529 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version 7.4.0 [junit4] 2> 789529 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null [junit4] 2> 789529 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null [junit4] 2> 789530 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2018-05-23T00:55:13.421Z [junit4] 2> 789535 INFO (zkConnectionManagerCallback-1417-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 789536 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading... [junit4] 2> 789555 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38179/solr [junit4] 2> 789560 INFO (zkConnectionManagerCallback-1421-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 789596 INFO (zkConnectionManagerCallback-1423-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 789653 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2) [junit4] 2> 789713 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.c.Overseer Overseer (id=null) closing [junit4] 2> 789716 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores [junit4] 2> 789716 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:46194_solr [junit4] 2> 789724 INFO (zkCallback-1385-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3) [junit4] 2> 789725 INFO (zkCallback-1407-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3) [junit4] 2> 789725 INFO (zkCallback-1399-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3) [junit4] 2> 789726 INFO (zkCallback-1392-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3) [junit4] 2> 789727 INFO (zkCallback-1422-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3) [junit4] 2> 789781 INFO (zkCallback-1414-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3) [junit4] 2> 790419 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_46194.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 790428 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_46194.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 790428 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_46194.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 790430 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.NodeAddedTriggerTest_BA3D4752AB1F3B9A-001/tempDir-001/node3/. [junit4] 2> 790477 INFO (zkConnectionManagerCallback-1430-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 790479 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (3) [junit4] 2> 790481 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:46194_solr ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38179/solr ready [junit4] 2> 790536 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server jetty-9.4.10.v20180503; built: 2018-05-03T15:56:21.710Z; git: daa59876e6f384329b122929e70a80934569428c; jvm 1.8.0_172-b11 [junit4] 2> 790538 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 790538 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 790538 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session node0 Scavenging every 600000ms [junit4] 2> 790538 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@430cd7bd{/solr,null,AVAILABLE} [junit4] 2> 790539 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@68e37247{HTTP/1.1,[http/1.1]}{127.0.0.1:53948} [junit4] 2> 790539 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server Started @790996ms [junit4] 2> 790539 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, hostPort=53948} [junit4] 2> 790539 ERROR (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 790539 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 790539 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version 7.4.0 [junit4] 2> 790539 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null [junit4] 2> 790539 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null [junit4] 2> 790539 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2018-05-23T00:55:14.430Z [junit4] 2> 790572 INFO (zkConnectionManagerCallback-1432-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 790574 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading... [junit4] 2> 790614 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38179/solr [junit4] 2> 790621 INFO (zkConnectionManagerCallback-1436-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 790634 INFO (zkConnectionManagerCallback-1438-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 790664 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (3) [junit4] 2> 790802 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.c.Overseer Overseer (id=null) closing [junit4] 2> 790808 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores [junit4] 2> 790808 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:53948_solr [junit4] 2> 790810 INFO (zkCallback-1392-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4) [junit4] 2> 790810 INFO (zkCallback-1399-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4) [junit4] 2> 790810 INFO (zkCallback-1407-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4) [junit4] 2> 790811 INFO (zkCallback-1422-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4) [junit4] 2> 790811 INFO (zkCallback-1414-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4) [junit4] 2> 790812 INFO (zkCallback-1429-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4) [junit4] 2> 790812 INFO (zkCallback-1385-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4) [junit4] 2> 790812 INFO (zkCallback-1437-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (4) [junit4] 2> 793299 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_53948.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 793310 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_53948.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 793310 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_53948.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 793311 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.NodeAddedTriggerTest_BA3D4752AB1F3B9A-001/tempDir-001/node4/. [junit4] 2> 793316 INFO (zkConnectionManagerCallback-1445-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 793318 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (4) [junit4] 2> 793319 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:53948_solr ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38179/solr ready [junit4] 2> 796397 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server jetty-9.4.10.v20180503; built: 2018-05-03T15:56:21.710Z; git: daa59876e6f384329b122929e70a80934569428c; jvm 1.8.0_172-b11 [junit4] 2> 796398 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 796398 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 796399 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session node0 Scavenging every 600000ms [junit4] 2> 796408 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@4734b321{/solr,null,AVAILABLE} [junit4] 2> 796408 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@3b428b1b{HTTP/1.1,[http/1.1]}{127.0.0.1:37219} [junit4] 2> 796408 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server Started @796869ms [junit4] 2> 796408 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, hostPort=37219} [junit4] 2> 796408 ERROR (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 796424 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 796435 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version 7.4.0 [junit4] 2> 796435 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null [junit4] 2> 796435 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null [junit4] 2> 796435 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2018-05-23T00:55:20.326Z [junit4] 2> 796443 INFO (zkConnectionManagerCallback-1447-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 796445 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading... [junit4] 2> 796474 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38179/solr [junit4] 2> 796492 INFO (zkConnectionManagerCallback-1451-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 796497 INFO (zkConnectionManagerCallback-1453-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 796515 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (4) [junit4] 2> 796522 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.c.Overseer Overseer (id=null) closing [junit4] 2> 796527 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores [junit4] 2> 796527 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:37219_solr [junit4] 2> 796533 INFO (zkCallback-1422-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 796533 INFO (zkCallback-1414-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 796537 INFO (zkCallback-1407-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 796538 INFO (zkCallback-1399-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 796538 INFO (zkCallback-1385-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 796545 INFO (zkCallback-1452-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 796545 INFO (zkCallback-1392-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 796545 INFO (zkCallback-1429-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 796553 INFO (zkCallback-1444-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 796553 INFO (zkCallback-1437-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 797776 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_37219.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 797787 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_37219.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 797787 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_37219.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 797789 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.NodeAddedTriggerTest_BA3D4752AB1F3B9A-001/tempDir-001/node5/. [junit4] 2> 797812 INFO (zkConnectionManagerCallback-1460-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 797815 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (5) [junit4] 2> 797818 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:37219_solr ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38179/solr ready [junit4] 2> 797935 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@3b428b1b{HTTP/1.1,[http/1.1]}{127.0.0.1:0} [junit4] 2> 797935 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=397508585 [junit4] 2> 797936 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null [junit4] 2> 797936 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@70006709: rootName = solr_37219, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@72092f70 [junit4] 2> 797946 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null [junit4] 2> 797946 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@498340b0: rootName = solr_37219, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@19de2126 [junit4] 2> 797951 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null [junit4] 2> 797951 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@6d9a2640: rootName = solr_37219, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@1623c889 [junit4] 2> 797961 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.ZkController Remove node as live in ZooKeeper:/live_nodes/127.0.0.1:37219_solr [junit4] 2> 797964 INFO (zkCallback-1385-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797965 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.cluster, tag=null [junit4] 2> 797966 INFO (zkCallback-1422-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797966 INFO (zkCallback-1407-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797966 INFO (zkCallback-1392-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797966 INFO (zkCallback-1444-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797966 INFO (zkCallback-1429-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797966 INFO (zkCallback-1452-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797967 INFO (zkCallback-1414-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797968 INFO (zkCallback-1437-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797971 INFO (zkCallback-1399-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797981 INFO (zkCallback-1459-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 797985 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@4734b321{/solr,null,UNAVAILABLE} [junit4] 2> 797985 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session node0 Stopped scavenging [junit4] 2> 797986 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 0x100894fef4e0015, likely client has closed socket [junit4] 2> 803023 INFO (TEST-NodeAddedTriggerTest.testTrigger-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testTrigger [junit4] 2> 803156 INFO (TEST-NodeAddedTriggerTest.testActionLifecycle-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testActionLifecycle [junit4] 2> 803161 INFO (TEST-NodeAddedTriggerTest.testActionLifecycle-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testActionLifecycle [junit4] 2> 803221 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.SolrTestCaseJ4 ###Starting testRestoreState [junit4] 2> 803223 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server jetty-9.4.10.v20180503; built: 2018-05-03T15:56:21.710Z; git: daa59876e6f384329b122929e70a80934569428c; jvm 1.8.0_172-b11 [junit4] 2> 803225 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session DefaultSessionIdManager workerName=node0 [junit4] 2> 803225 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session No SessionScavenger set, using defaults [junit4] 2> 803225 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.session node0 Scavenging every 660000ms [junit4] 2> 803225 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@770eb6d4{/solr,null,AVAILABLE} [junit4] 2> 803227 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.AbstractConnector Started ServerConnector@5460ef7d{HTTP/1.1,[http/1.1]}{127.0.0.1:38059} [junit4] 2> 803227 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.e.j.s.Server Started @803691ms [junit4] 2> 803227 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, hostPort=38059} [junit4] 2> 803227 ERROR (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete. [junit4] 2> 803229 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory [junit4] 2> 803229 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version 7.4.0 [junit4] 2> 803229 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null [junit4] 2> 803229 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null [junit4] 2> 803229 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time: 2018-05-23T00:55:27.120Z [junit4] 2> 803235 INFO (zkConnectionManagerCallback-1462-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 803237 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading... [junit4] 2> 803252 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38179/solr [junit4] 2> 803254 INFO (zkConnectionManagerCallback-1466-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 803258 INFO (zkConnectionManagerCallback-1468-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 803270 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (4) [junit4] 2> 803272 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.c.Overseer Overseer (id=null) closing [junit4] 2> 803275 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores [junit4] 2> 803275 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:38059_solr [junit4] 2> 803278 INFO (zkCallback-1414-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 803278 INFO (zkCallback-1437-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 803278 INFO (zkCallback-1422-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 803278 INFO (zkCallback-1399-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 803278 INFO (zkCallback-1385-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 803278 INFO (zkCallback-1444-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 803279 INFO (zkCallback-1429-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 803279 INFO (zkCallback-1407-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 803279 INFO (zkCallback-1392-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 803283 INFO (zkCallback-1467-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (5) [junit4] 2> 804031 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_38059.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 804041 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_38059.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 804042 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_38059.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@53f3838d [junit4] 2> 804043 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.NodeAddedTriggerTest_BA3D4752AB1F3B9A-001/tempDir-001/node6/. [junit4] 2> 804179 INFO (zkConnectionManagerCallback-1475-thread-1) [ ] o.a.s.c.c.ConnectionManager zkClient has connected [junit4] 2> 804246 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (5) [junit4] 2> 804248 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [n:127.0.0.1:38059_solr ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38179/solr ready [junit4] 2> 804349 INFO (TEST-NodeAddedTriggerTest.testRestoreState-seed#[BA3D4752AB1F3B9A]) [ ] o.a.s.SolrTestCaseJ4 ###Ending testRestoreState [junit4] 2> NOTE: reproduce with: ant test -Dtestcase=NodeAddedTriggerTest -Dtests.method=testRestoreState -Dtests.seed=BA3D4752AB1F3B9A -Dtests.slow=true -Dtests.locale=es-CL -Dtests.timezone=Indian/Mayotte -Dtests.asserts=true -Dtests.file.encoding=ISO-8859-1 [junit4] FAILURE 1.20s J0 | NodeAddedTriggerTest.testRestoreState <<< [junit4] > Throwable #1: java.lang.AssertionError: Did not expect the processor to fire on first run! event={ [junit4] > "id":"82f3c263a97d0Tem0lr4npep3x95anmd5gaq9q", [junit4] > "source":"node_added_trigger", [junit4] > "eventTime":2303735199602640, [junit4] > "eventType":"NODEADDED", [junit4] > "properties":{ [junit4] > "eventTimes":[ [junit4] > 2303735199602640, [junit4] > 2303735199604860, [junit4] > 2303735199606508, [junit4] > 2303735199607995], [junit4] > "nodeNames":[ [junit4] > "127.0.0.1:61925_solr", [junit4] > "127.0.0.1:44485_solr", [junit4] > "127.0.0.1:53948_solr", [junit4] > "127.0.0.1:46194_solr"]}} [junit4] > at __randomizedtesting.SeedInfo.seed([BA3D4752AB1F3B9A:7493E3C15326438C]:0) [junit4] > at org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest.lambda$new$0(NodeAddedTriggerTest.java:49) [junit4] > at org.apache.solr.cloud.autoscaling.NodeAddedTrigger.run(NodeAddedTrigger.java:161) [junit4] > at org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest.testRestoreState(NodeAddedTriggerTest.java:257) [junit4] > at java.lang.Thread.run(Thread.java:748) [junit4] 2> 804364 INFO (jetty-closer-1376-thread-1) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@4de5e007{HTTP/1.1,[http/1.1]}{127.0.0.1:0} [junit4] 2> 804395 INFO (jetty-closer-1376-thread-4) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@68e37247{HTTP/1.1,[http/1.1]}{127.0.0.1:0} [junit4] 2> 804396 INFO (jetty-closer-1376-thread-2) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@f4d8229{HTTP/1.1,[http/1.1]}{127.0.0.1:0} [junit4] 2> 804396 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=572912243 [junit4] 2> 804397 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null [junit4] 2> 804397 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@48c2c310: rootName = solr_61925, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@785763ef [junit4] 2> 804411 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null [junit4] 2> 804411 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@431e1534: rootName = solr_61925, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@19de2126 [junit4] 2> 804414 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null [junit4] 2> 804414 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@3ecdf5d9: rootName = solr_61925, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@1623c889 [junit4] 2> 804414 INFO (jetty-closer-1376-thread-6) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@5460ef7d{HTTP/1.1,[http/1.1]}{127.0.0.1:0} [junit4] 2> 804415 INFO (jetty-closer-1376-thread-2) [ ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=566518318 [junit4] 2> 804415 INFO (jetty-closer-1376-thread-2) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null [junit4] 2> 804415 INFO (jetty-closer-1376-thread-2) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@45ac45cf: rootName = solr_44485, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@1ca91778 [junit4] 2> 804419 INFO (jetty-closer-1376-thread-2) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null [junit4] 2> 804420 INFO (jetty-closer-1376-thread-2) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@45fe70c6: rootName = solr_44485, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@19de2126 [junit4] 2> 804432 INFO (jetty-closer-1376-thread-2) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null [junit4] 2> 804432 INFO (jetty-closer-1376-thread-2) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@76d44c7a: rootName = solr_44485, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@1623c889 [junit4] 2> 804432 INFO (jetty-closer-1376-thread-4) [ ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=1972504270 [junit4] 2> 804432 INFO (jetty-closer-1376-thread-4) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null [junit4] 2> 804433 INFO (jetty-closer-1376-thread-4) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@73d8851e: rootName = solr_53948, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@1021681e [junit4] 2> 804438 INFO (jetty-closer-1376-thread-4) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null [junit4] 2> 804438 INFO (jetty-closer-1376-thread-4) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@5b32f361: rootName = solr_53948, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@19de2126 [junit4] 2> 804441 INFO (jetty-closer-1376-thread-4) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null [junit4] 2> 804441 INFO (jetty-closer-1376-thread-4) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@40e80ab2: rootName = solr_53948, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@1623c889 [junit4] 2> 804442 INFO (jetty-closer-1376-thread-3) [ ] o.e.j.s.AbstractConnector Stopped ServerConnector@110ce546{HTTP/1.1,[http/1.1]}{127.0.0.1:0} [junit4] 2> 804445 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.c.ZkController Remove node as live in ZooKeeper:/live_nodes/127.0.0.1:61925_solr [junit4] 2> 804445 INFO (jetty-closer-1376-thread-6) [ ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=366578202 [junit4] 2> 804446 INFO (jetty-closer-1376-thread-6) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null [junit4] 2> 804446 INFO (jetty-closer-1376-thread-6) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@237cd1f8: rootName = solr_38059, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@3ca8dfe6 [junit4] 2> 804446 INFO (jetty-closer-1376-thread-2) [ ] o.a.s.c.ZkController Remove node as live in ZooKeeper:/live_nodes/127.0.0.1:44485_solr [junit4] 2> 804446 INFO (jetty-closer-1376-thread-3) [ ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=1095492023 [junit4] 2> 804447 INFO (jetty-closer-1376-thread-3) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node, tag=null [junit4] 2> 804447 INFO (jetty-closer-1376-thread-3) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@9b4b4ca: rootName = solr_46194, domain = solr.node, service url = null, agent id = null] for registry solr.node / com.codahale.metrics.MetricRegistry@5c88ef11 [junit4] 2> 804447 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.cluster, tag=null [junit4] 2> 804448 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores [junit4] 2> 804449 INFO (jetty-closer-1376-thread-1) [ ] o.a.s.c.Overseer Overseer (id=72208570448216067-127.0.0.1:61925_solr-n_0000000000) closing [junit4] 2> 804447 INFO (zkCallback-1422-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804450 INFO (zkCallback-1467-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804461 INFO (zkCallback-1474-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804462 INFO (OverseerStateUpdate-72208570448216067-127.0.0.1:61925_solr-n_0000000000) [ ] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:61925_solr [junit4] 2> 804463 WARN (OverseerAutoScalingTriggerThread-72208570448216067-127.0.0.1:61925_solr-n_0000000000) [ ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we are closed, exiting. [junit4] 2> 804466 INFO (zkCallback-1385-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804468 INFO (zkCallback-1444-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804468 INFO (zkCallback-1407-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804468 INFO (zkCallback-1437-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804469 INFO (zkCallback-1429-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804469 INFO (zkCallback-1392-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804470 INFO (zkCallback-1414-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (5) -> (4) [junit4] 2> 804473 INFO (jetty-closer-1376-thread-4) [ ] o.a.s.c.ZkController Remove node as live in ZooKeeper:/live_nodes/127.0.0.1:53948_solr [junit4] 2> 804476 INFO (jetty-closer-1376-thread-2) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.cluster, tag=null [junit4] 2> 804481 INFO (jetty-closer-1376-thread-4) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.cluster, tag=null [junit4] 2> 804485 INFO (jetty-closer-1376-thread-3) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null [junit4] 2> 804485 INFO (jetty-closer-1376-thread-3) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@7fc649da: rootName = solr_46194, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@19de2126 [junit4] 2> 804488 INFO (jetty-closer-1376-thread-3) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null [junit4] 2> 804489 INFO (jetty-closer-1376-thread-3) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@7de1eba6: rootName = solr_46194, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@1623c889 [junit4] 2> 804491 INFO (jetty-closer-1376-thread-6) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm, tag=null [junit4] 2> 804492 INFO (zkCallback-1444-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (2) [junit4] 2> 804492 INFO (zkCallback-1467-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (2) [junit4] 2> 804491 INFO (jetty-closer-1376-thread-6) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@210adce3: rootName = solr_38059, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / com.codahale.metrics.MetricRegistry@19de2126 [junit4] 2> 804511 INFO (zkCallback-1429-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (2) [junit4] 2> 804511 INFO (zkCallback-1422-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (2) [junit4] 2> 804512 INFO (zkCallback-1414-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (2) [junit4] 2> 804512 INFO (zkCallback-1437-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (2) [junit4] 2> 804512 INFO (jetty-closer-1376-thread-6) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty, tag=null [junit4] 2> 804512 INFO (jetty-closer-1376-thread-6) [ ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@15ac6c16: rootName = solr_38059, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty / com.codahale.metrics.MetricRegistry@1623c889 [junit4] 2> 804529 INFO (jetty-closer-1376-thread-3) [ ] o.a.s.c.ZkController Remove node as live in ZooKeeper:/live_nodes/127.0.0.1:46194_solr [junit4] 2> 804530 INFO (jetty-closer-1376-thread-6) [ ] o.a.s.c.ZkController Remove node as live in ZooKeeper:/live_nodes/127.0.0.1:38059_solr [junit4] 2> 804532 INFO (jetty-closer-1376-thread-6) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.cluster, tag=null [junit4] 2> 804532 INFO (zkCallback-1437-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (1) [junit4] 2> 804533 INFO (zkCallback-1467-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (0) [junit4] 2> 804533 INFO (zkCallback-1444-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (0) [junit4] 2> 804533 INFO (zkCallback-1429-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (0) [junit4] 2> 804533 INFO (zkCallback-1414-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (0) [junit4] 2> 804533 INFO (jetty-closer-1376-thread-3) [ ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.cluster, tag=null [junit4] 2> 804533 INFO (zkCallback-1422-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (0) [junit4] 2> 804540 INFO (zkCallback-1407-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (0) [junit4] 2> 804542 INFO (zkCallback-1474-thread-1) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (4) -> (0) [junit4] 2> 804542 INFO (zkCallback-1407-thread-2) [ ] o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:44485_solr [junit4] 2> 804555 INFO (zkCallback-1437-thread-2) [ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (0) [junit4] 2> 804560 INFO (zkCallback-1422-thread-1) [ ] o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:46194_solr [junit4] 2> 804614 INFO (jetty-closer-1376-thread-6) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@770eb6d4{/solr,null,UNAVAILABLE} [junit4] 2> 804614 INFO (jetty-closer-1376-thread-6) [ ] o.e.j.s.session node0 Stopped scavenging [junit4] 2> 804623 INFO (jetty-closer-1376-thread-2) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@4a19f21e{/solr,null,UNAVAILABLE} [junit4] 2> 804625 INFO (jetty-closer-1376-thread-2) [ ] o.e.j.s.session node0 Stopped scavenging [junit4] 2> 804649 INFO (jetty-closer-1376-thread-3) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@7b63927e{/solr,null,UNAVAILABLE} [junit4] 2> 804650 INFO (jetty-closer-1376-thread-3) [ ] o.e.j.s.session node0 Stopped scavenging [junit4] 2> 805977 WARN (zkCallback-1385-thread-1) [ ] o.a.s.c.c.ZkStateReader ZooKeeper watch triggered, but Solr cannot talk to ZK: [KeeperErrorCode = Session expired for /live_nodes] [junit4] 2> 805983 INFO (jetty-closer-1376-thread-1) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@1d2dfd90{/solr,null,UNAVAILABLE} [junit4] 2> 805983 INFO (jetty-closer-1376-thread-1) [ ] o.e.j.s.session node0 Stopped scavenging [junit4] 2> 806117 INFO (jetty-closer-1376-thread-4) [ ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@430cd7bd{/solr,null,UNAVAILABLE} [junit4] 2> 806118 INFO (jetty-closer-1376-thread-4) [ ] o.e.j.s.session node0 Stopped scavenging [junit4] 2> 806122 ERROR (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.z.s.ZooKeeperServer ZKShutdownHandler is not registered, so ZooKeeper server won't take any action on ERROR or SHUTDOWN server state changes [junit4] 2> 806123 INFO (SUITE-NodeAddedTriggerTest-seed#[BA3D4752AB1F3B9A]-worker) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:38179 38179 [junit4] 2> 807048 INFO (Thread-837) [ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1:38179 38179 [junit4] 2> 807049 WARN (Thread-837) [ ] o.a.s.c.ZkTestServer Watch limit violations: [junit4] 2> Maximum concurrent create/delete watches above limit: [junit4] 2> [junit4] 2> 13 /solr/aliases.json [junit4] 2> 13 /solr/clusterprops.json [junit4] 2> 6 /solr/security.json [junit4] 2> [junit4] 2> Maximum concurrent data watches above limit: [junit4] 2> [junit4] 2> 13 /solr/clusterstate.json [junit4] 2> 2 /solr/overseer_elect/election/72208570448216081-127.0.0.1:53948_solr-n_0000000003 [junit4] 2> [junit4] 2> Maximum concurrent children watches above limit: [junit4] 2> [junit4] 2> 13 /solr/live_nodes [junit4] 2> 13 /solr/collections [junit4] 2> [junit4] 2> NOTE: leaving temporary files on disk at: /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp/solr.cloud.autoscaling.NodeAddedTriggerTest_BA3D4752AB1F3B9A-001 [junit4] 2> NOTE: test params are: codec=Asserting(Lucene70), sim=RandomSimilarity(queryNorm=true): {}, locale=es-CL, timezone=Indian/Mayotte [junit4] 2> NOTE: SunOS 5.11 amd64/Oracle Corporation 1.8.0_172 (64-bit)/cpus=3,threads=1,free=61013624,total=369098752 [junit4] 2> NOTE: All tests run in this JVM: [IndexSchemaRuntimeFieldTest, TestManagedSchemaThreadSafety, TestSortByMinMaxFunction, SolrCloudReportersTest, TestPartialUpdateDeduplication, TestFunctionQuery, MaxSizeAutoCommitTest, RAMDirectoryFactoryTest, TestAnalyzeInfixSuggestions, SecurityConfHandlerTest, SignatureUpdateProcessorFactoryTest, TestRawTransformer, CdcrUpdateLogTest, InfixSuggestersTest, SOLR749Test, AddReplicaTest, TestSolrCloudWithSecureImpersonation, TestSweetSpotSimilarityFactory, TestEmbeddedSolrServerAdminHandler, TestDocTermOrds, TestPayloadScoreQParserPlugin, TestSolrCloudWithHadoopAuthPlugin, TestPseudoReturnFields, DistributedQueryComponentCustomSortTest, ZkCLITest, OverseerStatusTest, BlockDirectoryTest, HdfsWriteToMultipleCollectionsTest, TestCloudPivotFacet, NodeLostTriggerTest, TestPullReplicaErrorHandling, DocValuesMissingTest, TestInPlaceUpdatesDistrib, DirectSolrSpellCheckerTest, MetricsConfigTest, CdcrBootstrapTest, SharedFSAutoReplicaFailoverTest, WordBreakSolrSpellCheckerTest, TestEmbeddedSolrServerSchemaAPI, FieldMutatingUpdateProcessorTest, QueryResultKeyTest, TestFastOutputStream, TestCoreBackup, MultiTermTest, DistributedQueryElevationComponentTest, SearchRateTriggerIntegrationTest, TransactionLogTest, TestMaxScoreQueryParser, RegexBytesRefFilterTest, DeleteLastCustomShardedReplicaTest, TestLeaderInitiatedRecoveryThread, TestCorePropertiesReload, TestFileDictionaryLookup, HdfsSyncSliceTest, PluginInfoTest, LIROnShardRestartTest, TestRestoreCore, TestScoreJoinQPNoScore, TestJsonRequest, TestLargeCluster, DirectSolrConnectionTest, TestSolrDeletionPolicy1, TestInitParams, TestCollationField, OpenExchangeRatesOrgProviderTest, DirectUpdateHandlerOptimizeTest, TestConfigSetProperties, TestXIncludeConfig, CreateRoutedAliasTest, TestUseDocValuesAsStored2, SortSpecParsingTest, TestCSVResponseWriter, SolrJmxReporterTest, DeleteReplicaTest, MoreLikeThisHandlerTest, TestUtils, NodeAddedTriggerTest] [junit4] Completed [154/807 (1!)] on J0 in 21.85s, 4 tests, 1 failure <<< FAILURES! [...truncated 52627 lines...] [asciidoctor:convert] asciidoctor: ERROR: about-this-guide.adoc: line 1: invalid part, must have at least one section (e.g., chapter, appendix, etc.) [asciidoctor:convert] asciidoctor: ERROR: solr-glossary.adoc: line 1: invalid part, must have at least one section (e.g., chapter, appendix, etc.) [java] Processed 2199 links (1754 relative) to 2952 anchors in 228 files [echo] Validated Links & Anchors via: /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-ref-guide/bare-bones-html/ -documentation-lint: [jtidy] Checking for broken html (such as invalid tags)... [delete] Deleting directory /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/build/jtidy_tmp [echo] Checking for broken links... [exec] [exec] Crawl/parse... [exec] [exec] Verify... [echo] Checking for malformed docs... jar-checksums: 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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/top-level-ivy-settings.xml resolve: 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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/top-level-ivy-settings.xml common.resolve: 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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/top-level-ivy-settings.xml resolve: jar-checksums: [mkdir] Created dir: /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/null1998487492 [copy] Copying 39 files to /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/null1998487492 [delete] Deleting directory /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/null1998487492 resolve-example: 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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/top-level-ivy-settings.xml resolve: resolve-server: 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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/top-level-ivy-settings.xml resolve: 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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/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 = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/t [...truncated too long message...] gure] :: loading settings :: file = /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/lucene/top-level-ivy-settings.xml install-junit4-taskdef: ivy-availability-check: [loadresource] Do not set property disallowed.ivy.jars.list as its length is 0. -ivy-fail-disallowed-ivy-version: ivy-fail: resolve-groovy: [ivy:cachepath] :: resolving dependencies :: org.codehaus.groovy#groovy-all-caller;working [ivy:cachepath] confs: [default] [ivy:cachepath] found org.codehaus.groovy#groovy-all;2.4.15 in public [ivy:cachepath] :: resolution report :: resolve 13ms :: artifacts dl 0ms --------------------------------------------------------------------- | | modules || artifacts | | conf | number| search|dwnlded|evicted|| number|dwnlded| --------------------------------------------------------------------- | default | 1 | 0 | 0 | 0 || 1 | 0 | --------------------------------------------------------------------- -init-totals: -test: [mkdir] Created dir: /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test [junit4:pickseed] Seed property 'tests.seed' already defined: BA3D4752AB1F3B9A [mkdir] Created dir: /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/temp [junit4] <JUnit4> says g'day! Master seed: BA3D4752AB1F3B9A [junit4] Executing 5 suites with 2 JVMs. [junit4] [junit4] Started J0 PID(6517@serv1-vm3). [junit4] Started J1 PID(6516@serv1-vm3). [junit4] Suite: org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest [junit4] OK 0.72s J1 | NodeAddedTriggerTest.testListenerAcceptance [junit4] OK 11.0s J1 | NodeAddedTriggerTest.testTrigger [junit4] OK 0.03s J1 | NodeAddedTriggerTest.testActionLifecycle [junit4] OK 2.76s J1 | NodeAddedTriggerTest.testRestoreState [junit4] Completed [1/5] on J1 in 20.04s, 4 tests [junit4] [junit4] Suite: org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest [junit4] OK 0.68s J0 | NodeAddedTriggerTest.testListenerAcceptance [junit4] OK 11.8s J0 | NodeAddedTriggerTest.testTrigger [junit4] OK 0.03s J0 | NodeAddedTriggerTest.testActionLifecycle [junit4] OK 2.71s J0 | NodeAddedTriggerTest.testRestoreState [junit4] Completed [2/5] on J0 in 21.03s, 4 tests [junit4] [junit4] Duplicate suite name used with XML reports: org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest. This may confuse tools that process XML reports. Set 'ignoreDuplicateSuites' to true to skip this message. [junit4] Suite: org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest [junit4] OK 0.47s J0 | NodeAddedTriggerTest.testListenerAcceptance [junit4] OK 10.8s J0 | NodeAddedTriggerTest.testTrigger [junit4] OK 0.04s J0 | NodeAddedTriggerTest.testActionLifecycle [junit4] OK 2.63s J0 | NodeAddedTriggerTest.testRestoreState [junit4] Completed [3/5] on J0 in 16.71s, 4 tests [junit4] [junit4] Suite: org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest [junit4] OK 0.87s J1 | NodeAddedTriggerTest.testListenerAcceptance [junit4] OK 10.7s J1 | NodeAddedTriggerTest.testTrigger [junit4] OK 0.03s J1 | NodeAddedTriggerTest.testActionLifecycle [junit4] OK 2.43s J1 | NodeAddedTriggerTest.testRestoreState [junit4] Completed [4/5] on J1 in 18.85s, 4 tests [junit4] [junit4] Suite: org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest [junit4] OK 0.51s J0 | NodeAddedTriggerTest.testListenerAcceptance [junit4] OK 10.7s J0 | NodeAddedTriggerTest.testTrigger [junit4] OK 0.03s J0 | NodeAddedTriggerTest.testActionLifecycle [junit4] OK 2.66s J0 | NodeAddedTriggerTest.testRestoreState [junit4] Completed [5/5] on J0 in 16.77s, 4 tests [junit4] [junit4] JVM J0: 0.70 .. 56.12 = 55.42s [junit4] JVM J1: 0.70 .. 40.29 = 39.59s [junit4] Execution time total: 56 seconds [junit4] Tests summary: 5 suites, 20 tests [junit4] Could not remove temporary path: /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J1 (java.nio.file.DirectoryNotEmptyException: Remaining files: [/export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J1/temp]) [junit4] Could not remove temporary path: /export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0 (java.nio.file.DirectoryNotEmptyException: Remaining files: [/export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris/solr/build/solr-core/test/J0/temp]) [echo] 5 slowest tests: [junit4:tophints] 172.35s | org.apache.solr.cloud.autoscaling.SearchRateTriggerIntegrationTest [junit4:tophints] 129.98s | org.apache.solr.cloud.autoscaling.IndexSizeTriggerTest [junit4:tophints] 126.04s | org.apache.solr.cloud.TestTlogReplica [junit4:tophints] 123.38s | org.apache.solr.cloud.DeleteReplicaTest [junit4:tophints] 117.10s | org.apache.solr.update.SoftAutoCommitTest -check-totals: test-nocompile: BUILD SUCCESSFUL Total time: 58 seconds [repro] Failures: [repro] 0/5 failed: org.apache.solr.cloud.autoscaling.NodeAddedTriggerTest [repro] Exiting with code 0 + mv lucene/build lucene/build.repro + mv solr/build solr/build.repro + mv lucene/build.orig lucene/build + mv solr/build.orig solr/build Archiving artifacts Setting ANT_1_8_2_HOME=/export/home/jenkins/tools/hudson.tasks.Ant_AntInstallation/ANT_1.8.2 java.lang.InterruptedException: no matches found within 10000 at hudson.FilePath$34.hasMatch(FilePath.java:2678) at hudson.FilePath$34.invoke(FilePath.java:2557) at hudson.FilePath$34.invoke(FilePath.java:2547) at hudson.FilePath$FileCallableWrapper.call(FilePath.java:2918) Also: hudson.remoting.Channel$CallSiteStackTrace: Remote call to Solaris VBOX 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:1036) at hudson.FilePath.act(FilePath.java:1025) at hudson.FilePath.validateAntFileMask(FilePath.java:2547) 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:1819) 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:2920) 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:1149) at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:624) at java.lang.Thread.run(Thread.java:748) Caused: java.lang.InterruptedException: java.lang.InterruptedException: no matches found within 10000 at hudson.FilePath.act(FilePath.java:1038) at hudson.FilePath.act(FilePath.java:1025) at hudson.FilePath.validateAntFileMask(FilePath.java:2547) 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:1819) 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/**,**/*_pid*.log". Configuration error? [WARNINGS] Parsing warnings in console log with parser Java Compiler (javac) Setting ANT_1_8_2_HOME=/export/home/jenkins/tools/hudson.tasks.Ant_AntInstallation/ANT_1.8.2 Setting ANT_1_8_2_HOME=/export/home/jenkins/tools/hudson.tasks.Ant_AntInstallation/ANT_1.8.2 <Git Blamer> Using GitBlamer to create author and commit information for all warnings. <Git Blamer> GIT_COMMIT=982268efd14147ab99ab5b3e152fd4106e6581f1, workspace=/export/home/jenkins/workspace/Lucene-Solr-7.x-Solaris [WARNINGS] Computing warning deltas based on reference build #640 Recording test results Setting ANT_1_8_2_HOME=/export/home/jenkins/tools/hudson.tasks.Ant_AntInstallation/ANT_1.8.2 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) Setting ANT_1_8_2_HOME=/export/home/jenkins/tools/hudson.tasks.Ant_AntInstallation/ANT_1.8.2 Setting ANT_1_8_2_HOME=/export/home/jenkins/tools/hudson.tasks.Ant_AntInstallation/ANT_1.8.2 Setting ANT_1_8_2_HOME=/export/home/jenkins/tools/hudson.tasks.Ant_AntInstallation/ANT_1.8.2 Setting ANT_1_8_2_HOME=/export/home/jenkins/tools/hudson.tasks.Ant_AntInstallation/ANT_1.8.2
--------------------------------------------------------------------- To unsubscribe, e-mail: dev-unsubscr...@lucene.apache.org For additional commands, e-mail: dev-h...@lucene.apache.org