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: [email protected]
For additional commands, e-mail: [email protected]