Build: https://builds.apache.org/job/Lucene-Solr-NightlyTests-7.x/154/
2 tests failed.
FAILED:
junit.framework.TestSuite.org.apache.solr.update.processor.TimeRoutedAliasUpdateProcessorTest
Error Message:
1 thread leaked from SUITE scope at
org.apache.solr.update.processor.TimeRoutedAliasUpdateProcessorTest: 1)
Thread[id=137, name=qtp980971333-137, state=TIMED_WAITING,
group=TGRP-TimeRoutedAliasUpdateProcessorTest] at
sun.misc.Unsafe.park(Native Method) at
java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:215)
at
java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2163)
at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.reservedWait(ReservedThreadExecutor.java:308)
at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:373)
at
org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:708)
at
org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:626)
at java.lang.Thread.run(Thread.java:748)
Stack Trace:
com.carrotsearch.randomizedtesting.ThreadLeakError: 1 thread leaked from SUITE
scope at org.apache.solr.update.processor.TimeRoutedAliasUpdateProcessorTest:
1) Thread[id=137, name=qtp980971333-137, state=TIMED_WAITING,
group=TGRP-TimeRoutedAliasUpdateProcessorTest]
at sun.misc.Unsafe.park(Native Method)
at
java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:215)
at
java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2163)
at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.reservedWait(ReservedThreadExecutor.java:308)
at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:373)
at
org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:708)
at
org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:626)
at java.lang.Thread.run(Thread.java:748)
at __randomizedtesting.SeedInfo.seed([BDFFAB212FC1DDCD]:0)
FAILED:
junit.framework.TestSuite.org.apache.solr.update.processor.TimeRoutedAliasUpdateProcessorTest
Error Message:
There are still zombie threads that couldn't be terminated: 1)
Thread[id=137, name=qtp980971333-137, state=TIMED_WAITING,
group=TGRP-TimeRoutedAliasUpdateProcessorTest] at
sun.misc.Unsafe.park(Native Method) at
java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:215)
at
java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2163)
at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.reservedWait(ReservedThreadExecutor.java:308)
at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:373)
at
org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:708)
at
org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:626)
at java.lang.Thread.run(Thread.java:748)
Stack Trace:
com.carrotsearch.randomizedtesting.ThreadLeakError: There are still zombie
threads that couldn't be terminated:
1) Thread[id=137, name=qtp980971333-137, state=TIMED_WAITING,
group=TGRP-TimeRoutedAliasUpdateProcessorTest]
at sun.misc.Unsafe.park(Native Method)
at
java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:215)
at
java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2163)
at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.reservedWait(ReservedThreadExecutor.java:308)
at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:373)
at
org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:708)
at
org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:626)
at java.lang.Thread.run(Thread.java:748)
at __randomizedtesting.SeedInfo.seed([BDFFAB212FC1DDCD]:0)
Build Log:
[...truncated 12950 lines...]
[junit4] Suite:
org.apache.solr.update.processor.TimeRoutedAliasUpdateProcessorTest
[junit4] 2> Creating dataDir:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/init-core-data-001
[junit4] 2> 30294 WARN
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-worker) [
] o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=9 numCloses=9
[junit4] 2> 30306 INFO
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-worker) [
] o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true)
w/NUMERIC_DOCVALUES_SYSPROP=false
[junit4] 2> 30308 INFO
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-worker) [
] o.a.s.SolrTestCaseJ4 Randomized ssl (true) and clientAuth (true) via:
@org.apache.solr.util.RandomizeSSL(reason=, ssl=NaN, value=NaN, clientAuth=NaN)
[junit4] 2> 30309 INFO
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-worker) [
] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks:
test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
[junit4] 2> 30344 INFO
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-worker) [
] o.a.s.c.MiniSolrCloudCluster Starting cluster of 2 servers in
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001
[junit4] 2> 30474 INFO
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-worker) [
] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 30514 INFO (Thread-42) [ ] o.a.s.c.ZkTestServer client
port:0.0.0.0/0.0.0.0:0
[junit4] 2> 30514 INFO (Thread-42) [ ] o.a.s.c.ZkTestServer Starting
server
[junit4] 2> 30834 INFO
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-worker) [
] o.a.s.c.ZkTestServer start zk server on port:45034
[junit4] 2> 31593 WARN (NIOServerCxn.Factory:0.0.0.0/0.0.0.0:0) [ ]
o.a.z.s.NIOServerCnxn Exception causing close of session 0x0: ZooKeeperServer
not running
[junit4] 2> 31735 ERROR (Thread-42) [ ] 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> 33634 INFO (zkConnectionManagerCallback-17-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 33977 INFO (jetty-launcher-14-thread-1) [ ] o.e.j.s.Server
jetty-9.4.8.v20171121, build timestamp: 2017-11-22T01:27:37+04:00, git hash:
82b8fb23f757335bb3329d540ce37a2a2615f0a8
[junit4] 2> 33977 INFO (jetty-launcher-14-thread-2) [ ] o.e.j.s.Server
jetty-9.4.8.v20171121, build timestamp: 2017-11-22T01:27:37+04:00, git hash:
82b8fb23f757335bb3329d540ce37a2a2615f0a8
[junit4] 2> 34018 INFO (jetty-launcher-14-thread-1) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 34018 INFO (jetty-launcher-14-thread-1) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 34018 INFO (jetty-launcher-14-thread-1) [ ]
o.e.j.s.session Scavenging every 600000ms
[junit4] 2> 34046 INFO (jetty-launcher-14-thread-1) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@425be33c{/solr,null,AVAILABLE}
[junit4] 2> 34048 INFO (jetty-launcher-14-thread-1) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@4f73467{SSL,[ssl,
http/1.1]}{127.0.0.1:45324}
[junit4] 2> 34048 INFO (jetty-launcher-14-thread-1) [ ] o.e.j.s.Server
Started @36456ms
[junit4] 2> 34048 INFO (jetty-launcher-14-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr,
hostPort=45324}
[junit4] 2> 34049 ERROR (jetty-launcher-14-thread-1) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 34049 INFO (jetty-launcher-14-thread-1) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
7.3.0
[junit4] 2> 34049 INFO (jetty-launcher-14-thread-1) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 34049 INFO (jetty-launcher-14-thread-1) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null
[junit4] 2> 34049 INFO (jetty-launcher-14-thread-1) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2018-02-21T13:06:01.734Z
[junit4] 2> 34105 INFO (jetty-launcher-14-thread-2) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 34139 INFO (jetty-launcher-14-thread-1) [ ]
o.a.s.c.SolrResourceLoader solr home defaulted to 'solr/' (could not find
system property or JNDI)
[junit4] 2> 34139 INFO (jetty-launcher-14-thread-2) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 34139 INFO (jetty-launcher-14-thread-2) [ ]
o.e.j.s.session Scavenging every 660000ms
[junit4] 2> 34140 INFO (jetty-launcher-14-thread-2) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@2cc4e842{/solr,null,AVAILABLE}
[junit4] 2> 34141 INFO (jetty-launcher-14-thread-2) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@5ab8a620{SSL,[ssl,
http/1.1]}{127.0.0.1:37989}
[junit4] 2> 34142 INFO (jetty-launcher-14-thread-2) [ ] o.e.j.s.Server
Started @36549ms
[junit4] 2> 34142 INFO (jetty-launcher-14-thread-2) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr,
hostPort=37989}
[junit4] 2> 34142 ERROR (jetty-launcher-14-thread-2) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 34142 INFO (jetty-launcher-14-thread-2) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr? version
7.3.0
[junit4] 2> 34142 INFO (jetty-launcher-14-thread-2) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 34142 INFO (jetty-launcher-14-thread-2) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir: null
[junit4] 2> 34143 INFO (jetty-launcher-14-thread-2) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2018-02-21T13:06:01.827Z
[junit4] 2> 34204 INFO (zkConnectionManagerCallback-21-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 34204 INFO (zkConnectionManagerCallback-19-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 34278 INFO (jetty-launcher-14-thread-1) [ ]
o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
[junit4] 2> 34281 INFO (jetty-launcher-14-thread-2) [ ]
o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
[junit4] 2> 34691 INFO (jetty-launcher-14-thread-2) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:45034/solr
[junit4] 2> 34713 INFO (jetty-launcher-14-thread-1) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:45034/solr
[junit4] 2> 34935 INFO (zkConnectionManagerCallback-27-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 35000 INFO (zkConnectionManagerCallback-29-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 35130 INFO
(zkConnectionManagerCallback-31-thread-1-processing-n:127.0.0.1:37989_solr)
[n:127.0.0.1:37989_solr ] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 35363 INFO
(zkConnectionManagerCallback-33-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 38729 INFO (jetty-launcher-14-thread-1)
[n:127.0.0.1:45324_solr ] o.a.s.c.Overseer Overseer (id=null) closing
[junit4] 2> 38763 INFO (jetty-launcher-14-thread-1)
[n:127.0.0.1:45324_solr ] o.a.s.c.OverseerElectionContext I am going to be
the leader 127.0.0.1:45324_solr
[junit4] 2> 38799 INFO (jetty-launcher-14-thread-1)
[n:127.0.0.1:45324_solr ] o.a.s.c.Overseer Overseer
(id=72159552294682630-127.0.0.1:45324_solr-n_0000000000) starting
[junit4] 2> 38922 INFO (jetty-launcher-14-thread-2)
[n:127.0.0.1:37989_solr ] o.a.s.c.Overseer Overseer (id=null) closing
[junit4] 2> 38958 INFO (jetty-launcher-14-thread-2)
[n:127.0.0.1:37989_solr ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:37989_solr
[junit4] 2> 39137 INFO
(zkCallback-30-thread-1-processing-n:127.0.0.1:37989_solr)
[n:127.0.0.1:37989_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (1)
[junit4] 2> 39229 INFO
(zkCallback-32-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (1)
[junit4] 2> 41016 INFO (jetty-launcher-14-thread-1)
[n:127.0.0.1:45324_solr ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:45324_solr
[junit4] 2> 41158 INFO
(zkCallback-32-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (1) -> (2)
[junit4] 2> 41159 INFO
(zkCallback-30-thread-1-processing-n:127.0.0.1:37989_solr)
[n:127.0.0.1:37989_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (1) -> (2)
[junit4] 2> 41498 INFO (jetty-launcher-14-thread-2)
[n:127.0.0.1:37989_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_37989.solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@5ea3ad6f
[junit4] 2> 42274 INFO (jetty-launcher-14-thread-2)
[n:127.0.0.1:37989_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_37989.solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@5ea3ad6f
[junit4] 2> 42275 INFO (jetty-launcher-14-thread-2)
[n:127.0.0.1:37989_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_37989.solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@5ea3ad6f
[junit4] 2> 42495 INFO (jetty-launcher-14-thread-2)
[n:127.0.0.1:37989_solr ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/.
[junit4] 2> 42741 INFO (jetty-launcher-14-thread-1)
[n:127.0.0.1:45324_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_45324.solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@5ea3ad6f
[junit4] 2> 43300 INFO (jetty-launcher-14-thread-1)
[n:127.0.0.1:45324_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_45324.solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@5ea3ad6f
[junit4] 2> 43301 INFO (jetty-launcher-14-thread-1)
[n:127.0.0.1:45324_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_45324.solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@5ea3ad6f
[junit4] 2> 43648 INFO (jetty-launcher-14-thread-1)
[n:127.0.0.1:45324_solr ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node2/.
[junit4] 2> 44710 INFO (zkConnectionManagerCallback-39-thread-1) [ ]
o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 45747 INFO (qtp219882841-144) [n:127.0.0.1:37989_solr ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :clusterstatus with
params action=CLUSTERSTATUS&wt=javabin&version=2 and sendToOCPQueue=true
[junit4] 2> 45819 INFO (qtp219882841-144) [n:127.0.0.1:37989_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={action=CLUSTERSTATUS&wt=javabin&version=2} status=0 QTime=72
[junit4] 2> 46071 INFO
(TEST-TimeRoutedAliasUpdateProcessorTest.test-seed#[BDFFAB212FC1DDCD]) [ ]
o.a.s.SolrTestCaseJ4 ###Starting test
[junit4] 2> 46568 INFO (qtp980971333-135) [n:127.0.0.1:45324_solr ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :clusterstatus with
params action=CLUSTERSTATUS&wt=javabin&version=2 and sendToOCPQueue=true
[junit4] 2> 46622 INFO (qtp980971333-135) [n:127.0.0.1:45324_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={action=CLUSTERSTATUS&wt=javabin&version=2} status=0 QTime=54
[junit4] 2> 46625 INFO (qtp980971333-133) [n:127.0.0.1:45324_solr ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :clusterstatus with
params action=CLUSTERSTATUS&wt=javabin&version=2 and sendToOCPQueue=true
[junit4] 2> 46638 INFO (qtp980971333-133) [n:127.0.0.1:45324_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={action=CLUSTERSTATUS&wt=javabin&version=2} status=0 QTime=13
[junit4] 2> 46750 INFO (qtp980971333-136) [n:127.0.0.1:45324_solr ]
o.a.s.h.a.ConfigSetsHandler Invoked ConfigSet Action :create with params
baseConfigSet=_default&name=timeConfig&action=CREATE&wt=javabin&version=2
[junit4] 2> 46806 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.OverseerConfigSetMessageHandler
OverseerConfigSetMessageHandler.processMessage : create , {
[junit4] 2> "name":"timeConfig",
[junit4] 2> "baseConfigSet":"_default",
[junit4] 2> "immutable":"false",
[junit4] 2> "operation":"configsets:create"}
[junit4] 2> 46849 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/protwords.txt to /configs/timeConfig/protwords.txt
[junit4] 2> 46879 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/managed-schema to /configs/timeConfig/managed-schema
[junit4] 2> 46890 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/solrconfig.xml to /configs/timeConfig/solrconfig.xml
[junit4] 2> 46910 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/synonyms.txt to /configs/timeConfig/synonyms.txt
[junit4] 2> 46912 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/stopwords.txt to /configs/timeConfig/stopwords.txt
[junit4] 2> 46923 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/params.json to /configs/timeConfig/params.json
[junit4] 2> 46939 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/contractions_it.txt to
/configs/timeConfig/lang/contractions_it.txt
[junit4] 2> 46942 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_no.txt to
/configs/timeConfig/lang/stopwords_no.txt
[junit4] 2> 46944 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_hy.txt to
/configs/timeConfig/lang/stopwords_hy.txt
[junit4] 2> 46959 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stemdict_nl.txt to
/configs/timeConfig/lang/stemdict_nl.txt
[junit4] 2> 46961 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/contractions_ca.txt to
/configs/timeConfig/lang/contractions_ca.txt
[junit4] 2> 46976 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_id.txt to
/configs/timeConfig/lang/stopwords_id.txt
[junit4] 2> 47008 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ga.txt to
/configs/timeConfig/lang/stopwords_ga.txt
[junit4] 2> 47011 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_da.txt to
/configs/timeConfig/lang/stopwords_da.txt
[junit4] 2> 47036 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_hi.txt to
/configs/timeConfig/lang/stopwords_hi.txt
[junit4] 2> 47038 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ja.txt to
/configs/timeConfig/lang/stopwords_ja.txt
[junit4] 2> 47056 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_pt.txt to
/configs/timeConfig/lang/stopwords_pt.txt
[junit4] 2> 47058 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_hu.txt to
/configs/timeConfig/lang/stopwords_hu.txt
[junit4] 2> 47074 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_el.txt to
/configs/timeConfig/lang/stopwords_el.txt
[junit4] 2> 47093 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ru.txt to
/configs/timeConfig/lang/stopwords_ru.txt
[junit4] 2> 47095 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_tr.txt to
/configs/timeConfig/lang/stopwords_tr.txt
[junit4] 2> 47137 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ar.txt to
/configs/timeConfig/lang/stopwords_ar.txt
[junit4] 2> 47140 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/userdict_ja.txt to
/configs/timeConfig/lang/userdict_ja.txt
[junit4] 2> 47154 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_it.txt to
/configs/timeConfig/lang/stopwords_it.txt
[junit4] 2> 47156 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_eu.txt to
/configs/timeConfig/lang/stopwords_eu.txt
[junit4] 2> 47191 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_cz.txt to
/configs/timeConfig/lang/stopwords_cz.txt
[junit4] 2> 47193 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stoptags_ja.txt to
/configs/timeConfig/lang/stoptags_ja.txt
[junit4] 2> 47208 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/contractions_fr.txt to
/configs/timeConfig/lang/contractions_fr.txt
[junit4] 2> 47220 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_fa.txt to
/configs/timeConfig/lang/stopwords_fa.txt
[junit4] 2> 47222 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_de.txt to
/configs/timeConfig/lang/stopwords_de.txt
[junit4] 2> 47246 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/contractions_ga.txt to
/configs/timeConfig/lang/contractions_ga.txt
[junit4] 2> 47265 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ca.txt to
/configs/timeConfig/lang/stopwords_ca.txt
[junit4] 2> 47267 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_nl.txt to
/configs/timeConfig/lang/stopwords_nl.txt
[junit4] 2> 47268 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_bg.txt to
/configs/timeConfig/lang/stopwords_bg.txt
[junit4] 2> 47270 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_es.txt to
/configs/timeConfig/lang/stopwords_es.txt
[junit4] 2> 47280 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_en.txt to
/configs/timeConfig/lang/stopwords_en.txt
[junit4] 2> 47282 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_lv.txt to
/configs/timeConfig/lang/stopwords_lv.txt
[junit4] 2> 47297 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_th.txt to
/configs/timeConfig/lang/stopwords_th.txt
[junit4] 2> 47303 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ro.txt to
/configs/timeConfig/lang/stopwords_ro.txt
[junit4] 2> 47320 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_fr.txt to
/configs/timeConfig/lang/stopwords_fr.txt
[junit4] 2> 47322 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_sv.txt to
/configs/timeConfig/lang/stopwords_sv.txt
[junit4] 2> 47332 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_fi.txt to
/configs/timeConfig/lang/stopwords_fi.txt
[junit4] 2> 47349 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/hyphenations_ga.txt to
/configs/timeConfig/lang/hyphenations_ga.txt
[junit4] 2> 47372 INFO
(OverseerThreadFactory-78-thread-1-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_gl.txt to
/configs/timeConfig/lang/stopwords_gl.txt
[junit4] 2> 47453 INFO (qtp980971333-136) [n:127.0.0.1:45324_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/configs
params={baseConfigSet=_default&name=timeConfig&action=CREATE&wt=javabin&version=2}
status=0 QTime=702
[junit4] 2> 47457 INFO (qtp980971333-135) [n:127.0.0.1:45324_solr ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :clusterstatus with
params action=CLUSTERSTATUS&wt=javabin&version=2 and sendToOCPQueue=true
[junit4] 2> 47495 INFO (qtp980971333-135) [n:127.0.0.1:45324_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={action=CLUSTERSTATUS&wt=javabin&version=2} status=0 QTime=37
[junit4] 2> 47497 INFO (qtp980971333-136) [n:127.0.0.1:45324_solr ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :clusterstatus with
params action=CLUSTERSTATUS&wt=javabin&version=2 and sendToOCPQueue=true
[junit4] 2> 47497 INFO (qtp980971333-136) [n:127.0.0.1:45324_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={action=CLUSTERSTATUS&wt=javabin&version=2} status=0 QTime=0
[junit4] 2> 47499 INFO (qtp980971333-133) [n:127.0.0.1:45324_solr ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params
replicationFactor=1&collection.configName=timeConfig&name=timeConfig&nrtReplicas=1&action=CREATE&numShards=1&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 47521 INFO
(OverseerThreadFactory-78-thread-2-processing-n:127.0.0.1:45324_solr)
[n:127.0.0.1:45324_solr ] o.a.s.c.a.c.CreateCollectionCmd Create collection
timeConfig
[junit4] 2> 47522 INFO
(OverseerCollectionConfigSetProcessor-72159552294682630-127.0.0.1:45324_solr-n_0000000000)
[n:127.0.0.1:45324_solr ] o.a.s.c.OverseerTaskQueue Response ZK path:
/overseer/collection-queue-work/qnr-0000000000 doesn't exist. Requestor may
have disconnected from ZooKeeper
[junit4] 2> 47669 INFO
(OverseerStateUpdate-72159552294682630-127.0.0.1:45324_solr-n_0000000000)
[n:127.0.0.1:45324_solr ] o.a.s.c.o.SliceMutator createReplica() {
[junit4] 2> "operation":"ADDREPLICA",
[junit4] 2> "collection":"timeConfig",
[junit4] 2> "shard":"shard1",
[junit4] 2> "core":"timeConfig_shard1_replica_n1",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"https://127.0.0.1:37989/solr",
[junit4] 2> "type":"NRT",
[junit4] 2> "waitForFinalState":"false"}
[junit4] 2> 47888 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr ]
o.a.s.h.a.CoreAdminOperation core create command
qt=/admin/cores&coreNodeName=core_node2&collection.configName=timeConfig&newCollection=true&name=timeConfig_shard1_replica_n1&action=CREATE&numShards=1&collection=timeConfig&shard=shard1&wt=javabin&version=2&replicaType=NRT
[junit4] 2> 47890 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr ]
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647
transient cores
[junit4] 2> 48053 INFO
(zkCallback-30-thread-2-processing-n:127.0.0.1:37989_solr)
[n:127.0.0.1:37989_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/timeConfig/state.json] for collection [timeConfig] has
occurred - updating... (live nodes size: [2])
[junit4] 2> 48054 INFO
(zkCallback-30-thread-1-processing-n:127.0.0.1:37989_solr)
[n:127.0.0.1:37989_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/timeConfig/state.json] for collection [timeConfig] has
occurred - updating... (live nodes size: [2])
[junit4] 2> 49074 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.RequestParams conf resource params.json loaded . version : 0
[junit4] 2> 49075 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.RequestParams request params refreshed to version 0
[junit4] 2> 49077 WARN (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/extraction/lib
filtered by .*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/extraction/lib
[junit4] 2> 49077 WARN (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
filtered by solr-cell-\d.*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
[junit4] 2> 49078 WARN (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/clustering/lib
filtered by .*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/clustering/lib
[junit4] 2> 49078 WARN (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
filtered by solr-clustering-\d.*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
[junit4] 2> 49078 WARN (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/langid/lib
filtered by .*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/langid/lib
[junit4] 2> 49099 WARN (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
filtered by solr-langid-\d.*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
[junit4] 2> 49099 WARN (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/velocity/lib
filtered by .*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/velocity/lib
[junit4] 2> 49099 WARN (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
filtered by solr-velocity-\d.*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
[junit4] 2> 49159 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.3.0
[junit4] 2> 49831 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.IndexSchema [timeConfig_shard1_replica_n1] Schema name=default-config
[junit4] 2> 52313 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.IndexSchema Loaded schema default-config/1.6 with uniqueid field id
[junit4] 2> 52524 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.CoreContainer Creating SolrCore 'timeConfig_shard1_replica_n1' using
configuration from collection timeConfig, trusted=true
[junit4] 2> 52570 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_37989.solr.core.timeConfig.shard1.replica_n1' (registry
'solr.core.timeConfig.shard1.replica_n1') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@5ea3ad6f
[junit4] 2> 52570 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
[junit4] 2> 52570 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SolrCore [[timeConfig_shard1_replica_n1] ] Opening new SolrCore at
[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1],
dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/./timeConfig_shard1_replica_n1/data/]
[junit4] 2> 52813 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.r.XSLTResponseWriter xsltCacheLifetimeSeconds=5
[junit4] 2> 54260 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.u.UpdateHandler Using UpdateLog implementation:
org.apache.solr.update.UpdateLog
[junit4] 2> 54260 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH
numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 54262 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.u.CommitTracker Hard AutoCommit: if uncommited for 15000ms;
[junit4] 2> 54262 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.u.CommitTracker Soft AutoCommit: disabled
[junit4] 2> 54294 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.SolrIndexSearcher Opening
[Searcher@3ca8f21a[timeConfig_shard1_replica_n1] main]
[junit4] 2> 54311 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/timeConfig
[junit4] 2> 54329 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/timeConfig
[junit4] 2> 54331 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.ZkIndexSchemaReader Creating ZooKeeper watch for the managed schema at
/configs/timeConfig/managed-schema
[junit4] 2> 54418 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.ZkIndexSchemaReader Current schema version 0 is already the latest
[junit4] 2> 54419 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
[junit4] 2> 54461 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.DirectSolrSpellChecker init:
{name=default,field=_text_,classname=solr.DirectSolrSpellChecker,distanceMeasure=internal,accuracy=0.5,maxEdits=2,minPrefix=1,maxInspections=5,minQueryLength=4,maxQueryFrequency=0.01}
[junit4] 2> 54642 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
[junit4] 2> 54653 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.u.UpdateLog Could not find max version in index or recent updates, using
new clock 1593015934478450688
[junit4] 2> 54658 INFO
(searcherExecutor-82-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.c.QuerySenderListener QuerySenderListener
sending requests to Searcher@3ca8f21a[timeConfig_shard1_replica_n1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 54658 INFO
(searcherExecutor-82-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.c.QuerySenderListener QuerySenderListener
done.
[junit4] 2> 54658 INFO
(searcherExecutor-82-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.c.SpellCheckComponent Loading spell
index for spellchecker: default
[junit4] 2> 54716 INFO
(searcherExecutor-82-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.c.SolrCore [timeConfig_shard1_replica_n1]
Registered new searcher Searcher@3ca8f21a[timeConfig_shard1_replica_n1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 54844 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
[junit4] 2> 54844 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
[junit4] 2> 54854 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SyncStrategy Sync replicas to
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/
[junit4] 2> 54855 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
[junit4] 2> 54856 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.SyncStrategy https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/
has no replicas
[junit4] 2> 54856 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.ShardLeaderElectionContext Found all replicas participating in
election, clear LIR
[junit4] 2> 54923 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.ShardLeaderElectionContext I am the new leader:
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ shard1
[junit4] 2> 54952 INFO
(zkCallback-30-thread-1-processing-n:127.0.0.1:37989_solr)
[n:127.0.0.1:37989_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/timeConfig/state.json] for collection [timeConfig] has
occurred - updating... (live nodes size: [2])
[junit4] 2> 54952 INFO
(zkCallback-30-thread-2-processing-n:127.0.0.1:37989_solr)
[n:127.0.0.1:37989_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/timeConfig/state.json] for collection [timeConfig] has
occurred - updating... (live nodes size: [2])
[junit4] 2> 54987 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.ZkController I am the leader, no recovery necessary
[junit4] 2> 54991 INFO (qtp219882841-145) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores
params={qt=/admin/cores&coreNodeName=core_node2&collection.configName=timeConfig&newCollection=true&name=timeConfig_shard1_replica_n1&action=CREATE&numShards=1&collection=timeConfig&shard=shard1&wt=javabin&version=2&replicaType=NRT}
status=0 QTime=7104
[junit4] 2> 55043 INFO (qtp980971333-133) [n:127.0.0.1:45324_solr ]
o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most
30 seconds. Check all shard replicas
[junit4] 2> 55187 INFO
(zkCallback-30-thread-2-processing-n:127.0.0.1:37989_solr)
[n:127.0.0.1:37989_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/timeConfig/state.json] for collection [timeConfig] has
occurred - updating... (live nodes size: [2])
[junit4] 2> 55187 INFO
(zkCallback-30-thread-1-processing-n:127.0.0.1:37989_solr)
[n:127.0.0.1:37989_solr ] o.a.s.c.c.ZkStateReader A cluster state change:
[WatchedEvent state:SyncConnected type:NodeDataChanged
path:/collections/timeConfig/state.json] for collection [timeConfig] has
occurred - updating... (live nodes size: [2])
[junit4] 2> 55602 INFO
(OverseerCollectionConfigSetProcessor-72159552294682630-127.0.0.1:45324_solr-n_0000000000)
[n:127.0.0.1:45324_solr ] o.a.s.c.OverseerTaskQueue Response ZK path:
/overseer/collection-queue-work/qnr-0000000002 doesn't exist. Requestor may
have disconnected from ZooKeeper
[junit4] 2> 56162 INFO (qtp980971333-133) [n:127.0.0.1:45324_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={replicationFactor=1&collection.configName=timeConfig&name=timeConfig&nrtReplicas=1&action=CREATE&numShards=1&wt=javabin&version=2}
status=0 QTime=8663
[junit4] 2> 56187 INFO (qtp980971333-135) [n:127.0.0.1:45324_solr ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :clusterstatus with
params action=CLUSTERSTATUS&wt=javabin&version=2 and sendToOCPQueue=true
[junit4] 2> 56207 INFO (qtp980971333-135) [n:127.0.0.1:45324_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={action=CLUSTERSTATUS&wt=javabin&version=2} status=0 QTime=20
[junit4] 2> 56223 INFO (qtp980971333-133) [n:127.0.0.1:45324_solr ]
o.a.s.h.a.CollectionsHandler Invoked Collection Action :clusterstatus with
params action=CLUSTERSTATUS&wt=javabin&version=2 and sendToOCPQueue=true
[junit4] 2> 56226 INFO (qtp980971333-133) [n:127.0.0.1:45324_solr ]
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={action=CLUSTERSTATUS&wt=javabin&version=2} status=0 QTime=2
[junit4] 2> 56748 INFO (qtp219882841-142) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler Executed config commands successfully and persisted
to ZK [{"set-user-property":{"update.autoCreateFields":false}},
{"add-updateprocessor":{
[junit4] 2> "name":"tolerant",
[junit4] 2> "class":"solr.TolerantUpdateProcessorFactory"}},
{"add-updateprocessor":{
[junit4] 2> "name":"inc",
[junit4] 2>
"class":"org.apache.solr.update.processor.TimeRoutedAliasUpdateProcessorTest$IncrementURPFactory",
[junit4] 2> "fieldName":"integer_i"}}]
[junit4] 2> 56750 INFO (qtp219882841-142) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler Waiting up to 30 secs for 1 replicas to set the
property overlay to be of version 0 for collection timeConfig
[junit4] 2> 56820 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 0
secs, maxWait 30
[junit4] 2> 56856 INFO (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrCore config update listener called for core
timeConfig_shard1_replica_n1
[junit4] 2> 56857 INFO (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrCore core reload timeConfig_shard1_replica_n1
[junit4] 2> 56964 INFO (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.RequestParams conf resource params.json loaded . version : 0
[junit4] 2> 56964 INFO (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.RequestParams request params refreshed to version 0
[junit4] 2> 56965 WARN (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/extraction/lib
filtered by .*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/extraction/lib
[junit4] 2> 57044 WARN (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
filtered by solr-cell-\d.*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
[junit4] 2> 57044 WARN (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/clustering/lib
filtered by .*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/clustering/lib
[junit4] 2> 57044 WARN (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
filtered by solr-clustering-\d.*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
[junit4] 2> 57044 WARN (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/langid/lib
filtered by .*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/langid/lib
[junit4] 2> 57045 WARN (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
filtered by solr-langid-\d.*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
[junit4] 2> 57045 WARN (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/velocity/lib
filtered by .*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../contrib/velocity/lib
[junit4] 2> 57045 WARN (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrConfig Couldn't add files from
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
filtered by solr-velocity-\d.*\.jar to classpath:
/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1/../../../../dist
[junit4] 2> 57130 INFO (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.3.0
[junit4] 2> 57385 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 57386 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=83
[junit4] 2> 57386 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 57387 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 1 attempts
[junit4] 2> 57387 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 0
secs, maxWait 30
[junit4] 2> 57388 INFO (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.s.IndexSchema [timeConfig_shard1_replica_n1] Schema name=default-config
[junit4] 2> 57532 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 57551 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=19
[junit4] 2> 57563 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 57589 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 2 attempts
[junit4] 2> 57589 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 0
secs, maxWait 30
[junit4] 2> 57717 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 57723 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=5
[junit4] 2> 57723 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 57750 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 3 attempts
[junit4] 2> 57750 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 0
secs, maxWait 30
[junit4] 2> 57874 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 57874 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=0
[junit4] 2> 57875 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 4 attempts
[junit4] 2> 57876 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 1
secs, maxWait 30
[junit4] 2> 57888 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 57996 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 58031 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=35
[junit4] 2> 58032 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 58032 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 5 attempts
[junit4] 2> 58032 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 1
secs, maxWait 30
[junit4] 2> 58151 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 58152 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=1
[junit4] 2> 58202 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 6 attempts
[junit4] 2> 58202 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 1
secs, maxWait 30
[junit4] 2> 58202 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 58333 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 58352 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=19
[junit4] 2> 58368 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 58368 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 7 attempts
[junit4] 2> 58368 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 1
secs, maxWait 30
[junit4] 2> 58526 INFO (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.s.IndexSchema Loaded schema default-config/1.6 with uniqueid field id
[junit4] 2> 58528 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 58543 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=15
[junit4] 2> 58544 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 58567 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 8 attempts
[junit4] 2> 58567 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 1
secs, maxWait 30
[junit4] 2> 58691 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 58692 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=0
[junit4] 2> 58693 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 9 attempts
[junit4] 2> 58693 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 1
secs, maxWait 30
[junit4] 2> 58726 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 58797 INFO (Thread-61) [n:127.0.0.1:37989_solr ]
o.a.s.c.CoreContainer Reloading SolrCore 'timeConfig_shard1_replica_n1' using
configuration from collection timeConfig
[junit4] 2> 58947 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 58953 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=6
[junit4] 2> 58954 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 58962 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 10 attempts
[junit4] 2> 58962 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 2
secs, maxWait 30
[junit4] 2> 59148 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 59181 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 59181 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=33
[junit4] 2> 59182 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 11 attempts
[junit4] 2> 59182 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 2
secs, maxWait 30
[junit4] 2> 59309 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 59327 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=18
[junit4] 2> 59328 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 59328 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 12 attempts
[junit4] 2> 59328 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 2
secs, maxWait 30
[junit4] 2> 59424 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1] o.a.s.m.r.SolrJmxReporter
JMX monitoring for 'solr_37989.solr.core.timeConfig.shard1.replica_n1'
(registry 'solr.core.timeConfig.shard1.replica_n1') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@5ea3ad6f
[junit4] 2> 59457 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1] o.a.s.c.SolrCore
[[timeConfig_shard1_replica_n1] ] Opening new SolrCore at
[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/timeConfig_shard1_replica_n1],
dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/checkout/solr/build/solr-core/test/J2/temp/solr.update.processor.TimeRoutedAliasUpdateProcessorTest_BDFFAB212FC1DDCD-001/tempDir-001/node1/./timeConfig_shard1_replica_n1/data/]
[junit4] 2> 59439 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 59474 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=34
[junit4] 2> 59475 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 13 attempts
[junit4] 2> 59475 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 2
secs, maxWait 30
[junit4] 2> 59475 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 59512 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.r.XSLTResponseWriter xsltCacheLifetimeSeconds=5
[junit4] 2> 59605 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 59605 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=0
[junit4] 2> 59606 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 14 attempts
[junit4] 2> 59606 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 2
secs, maxWait 30
[junit4] 2> 59620 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 59772 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 59787 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=14
[junit4] 2> 59787 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 59787 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 15 attempts
[junit4] 2> 59788 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 2
secs, maxWait 30
[junit4] 2> 59918 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 59918 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=0
[junit4] 2> 59920 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 16 attempts
[junit4] 2> 59920 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 3
secs, maxWait 30
[junit4] 2> 59933 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 60064 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 60075 INFO (qtp219882841-143) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=11
[junit4] 2> 60091 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 17 attempts
[junit4] 2> 60092 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 3
secs, maxWait 30
[junit4] 2> 60092 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 60126 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1] o.a.s.u.CommitTracker
Hard AutoCommit: if uncommited for 15000ms;
[junit4] 2> 60126 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1] o.a.s.u.CommitTracker
Soft AutoCommit: disabled
[junit4] 2> 60333 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.SolrConfigHandler expecting overlay version 0 but my version is -1
[junit4] 2> 60348 INFO (qtp219882841-146) [n:127.0.0.1:37989_solr
c:timeConfig s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.c.S.Request [timeConfig_shard1_replica_n1] webapp=/solr
path=/config/znodeVersion params={overlay=0&wt=javabin&version=2} status=0
QTime=15
[junit4] 2> 60348 INFO (SolrConfigHandler-refreshconf)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Another reload is in
progress . Not doing anything
[junit4] 2> 60349 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Could not get
expectedVersion 0 from
https://127.0.0.1:37989/solr/timeConfig_shard1_replica_n1/ for prop overlay
after 18 attempts
[junit4] 2> 60349 INFO
(solrHandlerExecutor-87-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.h.SolrConfigHandler Time elapsed : 3
secs, maxWait 30
[junit4] 2> 60409 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1] o.a.s.s.SolrIndexSearcher
Opening [Searcher@4a124a19[timeConfig_shard1_replica_n1] main]
[junit4] 2> 60412 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase:
/configs/timeConfig
[junit4] 2> 60431 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/timeConfig
[junit4] 2> 60431 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.ZkIndexSchemaReader Creating ZooKeeper watch for the managed schema at
/configs/timeConfig/managed-schema
[junit4] 2> 60432 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.ZkIndexSchemaReader Current schema version 0 is already the latest
[junit4] 2> 60449 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.c.SpellCheckComponent Initializing spell checkers
[junit4] 2> 60449 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.s.DirectSolrSpellChecker init:
{name=default,field=_text_,classname=solr.DirectSolrSpellChecker,distanceMeasure=internal,accuracy=0.5,maxEdits=2,minPrefix=1,maxInspections=5,minQueryLength=4,maxQueryFrequency=0.01}
[junit4] 2> 60450 INFO (Thread-61) [n:127.0.0.1:37989_solr c:timeConfig
s:shard1 r:core_node2 x:timeConfig_shard1_replica_n1]
o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
[junit4] 2> 60461 INFO
(searcherExecutor-88-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.c.QuerySenderListener QuerySenderListener
sending requests to Searcher@4a124a19[timeConfig_shard1_replica_n1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 60462 INFO
(searcherExecutor-88-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c:timeConfig s:shard1 r:core_node2
x:timeConfig_shard1_replica_n1] o.a.s.c.QuerySenderListener QuerySenderListener
done.
[junit4] 2> 60462 INFO
(searcherExecutor-88-thread-1-processing-n:127.0.0.1:37989_solr
x:timeConfig_shard1_replica_n1 s:shard1 c:timeConfig r:core_node2)
[n:127.0.0.1:37989_solr c
[...truncated too long message...]
verseer Loop exiting : 127.0.0.1:45324_solr
[junit4] 2> 118261 WARN
(OverseerAutoScalingTriggerThread-72159552294682630-127.0.0.1:45324_solr-n_0000000000)
[n:127.0.0.1:45324_solr ] o.a.s.c.a.OverseerTriggerThread
OverseerTriggerThread woken up but we are closed, exiting.
[junit4] 2> 118298 INFO (jetty-closer-15-thread-2) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.s.ServletContextHandler@2cc4e842{/solr,null,UNAVAILABLE}
[junit4] 2> 118298 INFO (jetty-closer-15-thread-2) [ ] o.e.j.s.session
Stopped scavenging
[junit4] 2> 118298 INFO (jetty-closer-15-thread-1) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.s.ServletContextHandler@425be33c{/solr,null,UNAVAILABLE}
[junit4] 2> 118299 INFO (jetty-closer-15-thread-1) [ ] o.e.j.s.session
Stopped scavenging
[junit4] 2> 148301 WARN (jetty-closer-15-thread-1) [ ]
o.e.j.u.t.QueuedThreadPool
QueuedThreadPool@qtp980971333{STOPPING,8<=10<=10000,i=0,q=1} Couldn't stop
Thread[qtp980971333-137,5,TGRP-TimeRoutedAliasUpdateProcessorTest]
[junit4] 2> 148302 ERROR
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-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> 148303 INFO
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-worker) [
] o.a.s.c.ZkTestServer connecting to 127.0.0.1:45034 45034
[junit4] 2> 148553 INFO (Thread-42) [ ] o.a.s.c.ZkTestServer
connecting to 127.0.0.1:45034 45034
[junit4] 2> 148562 WARN (Thread-42) [ ] o.a.s.c.ZkTestServer Watch
limit violations:
[junit4] 2> Maximum concurrent create/delete watches above limit:
[junit4] 2>
[junit4] 2> 10 /solr/configs/timeConfig/managed-schema
[junit4] 2> 7
/solr/collections/myalias_2017-10-23/terms/shard2
[junit4] 2> 7
/solr/collections/myalias_2017-10-23/terms/shard1
[junit4] 2> 6 /solr/configs/timeConfig
[junit4] 2> 4 /solr/aliases.json
[junit4] 2> 3 /solr/collections/timeConfig/terms/shard1
[junit4] 2> 2
/solr/collections/myalias_2017-10-24/terms/shard1
[junit4] 2> 2
/solr/collections/myalias_2017-10-25/terms/shard1
[junit4] 2> 2
/solr/collections/myalias_2017-10-27/terms/shard1
[junit4] 2> 2
/solr/collections/myalias_2017-10-26/terms/shard1
[junit4] 2> 2 /solr/security.json
[junit4] 2>
[junit4] 2> Maximum concurrent data watches above limit:
[junit4] 2>
[junit4] 2> 12 /solr/collections/myalias_2017-10-23/state.json
[junit4] 2> 6 /solr/collections/myalias_2017-10-27/state.json
[junit4] 2> 6 /solr/collections/myalias_2017-10-26/state.json
[junit4] 2> 5 /solr/collections/myalias_2017-10-25/state.json
[junit4] 2> 5 /solr/collections/myalias_2017-10-24/state.json
[junit4] 2> 5 /solr/collections/timeConfig/state.json
[junit4] 2> 4 /solr/clusterprops.json
[junit4] 2> 4 /solr/clusterstate.json
[junit4] 2>
[junit4] 2> Maximum concurrent children watches above limit:
[junit4] 2>
[junit4] 2> 4 /solr/live_nodes
[junit4] 2> 4 /solr/collections
[junit4] 2>
[junit4] 2> 148562 INFO
(SUITE-TimeRoutedAliasUpdateProcessorTest-seed#[BDFFAB212FC1DDCD]-worker) [
] o.a.s.SolrTestCaseJ4 -------------------------------------------------------
Done waiting for tracked resources to be released
[junit4] 2> Feb 21, 2018 1:07:56 PM
com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
[junit4] 2> WARNING: Will linger awaiting termination of 1 leaked
thread(s).
[junit4] 2> Feb 21, 2018 1:08:16 PM
com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
[junit4] 2> SEVERE: 1 thread leaked from SUITE scope at
org.apache.solr.update.processor.TimeRoutedAliasUpdateProcessorTest:
[junit4] 2> 1) Thread[id=137, name=qtp980971333-137,
state=TIMED_WAITING, group=TGRP-TimeRoutedAliasUpdateProcessorTest]
[junit4] 2> at sun.misc.Unsafe.park(Native Method)
[junit4] 2> at
java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:215)
[junit4] 2> at
java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2163)
[junit4] 2> at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.reservedWait(ReservedThreadExecutor.java:308)
[junit4] 2> at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:373)
[junit4] 2> at
org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:708)
[junit4] 2> at
org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:626)
[junit4] 2> at java.lang.Thread.run(Thread.java:748)
[junit4] 2> Feb 21, 2018 1:08:16 PM
com.carrotsearch.randomizedtesting.ThreadLeakControl tryToInterruptAll
[junit4] 2> INFO: Starting to interrupt leaked threads:
[junit4] 2> 1) Thread[id=137, name=qtp980971333-137,
state=TIMED_WAITING, group=TGRP-TimeRoutedAliasUpdateProcessorTest]
[junit4] 2> Feb 21, 2018 1:08:20 PM
com.carrotsearch.randomizedtesting.ThreadLeakControl tryToInterruptAll
[junit4] 2> SEVERE: There are still zombie threads that couldn't be
terminated:
[junit4] 2> 1) Thread[id=137, name=qtp980971333-137,
state=TIMED_WAITING, group=TGRP-TimeRoutedAliasUpdateProcessorTest]
[junit4] 2> at sun.misc.Unsafe.park(Native Method)
[junit4] 2> at
java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:215)
[junit4] 2> at
java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2163)
[junit4] 2> at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.reservedWait(ReservedThreadExecutor.java:308)
[junit4] 2> at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:373)
[junit4] 2> at
org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:708)
[junit4] 2> at
org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:626)
[junit4] 2> at java.lang.Thread.run(Thread.java:748)
[junit4] 2> NOTE: test params are: codec=Asserting(Lucene70): {},
docValues:{}, maxPointsInLeafNode=694, maxMBSortInHeap=5.296522037108085,
sim=RandomSimilarity(queryNorm=false): {}, locale=ar-EG, timezone=BET
[junit4] 2> NOTE: Linux 4.4.0-112-generic amd64/Oracle Corporation
1.8.0_152 (64-bit)/cpus=4,threads=2,free=210086600,total=317194240
[junit4] 2> NOTE: All tests run in this JVM:
[DistributedExpandComponentTest, TimeRoutedAliasUpdateProcessorTest]
[junit4] 2> NOTE: download the large Jenkins line-docs file by running
'ant get-jenkins-line-docs' in the lucene directory.
[junit4] 2> NOTE: reproduce with: ant test
-Dtestcase=TimeRoutedAliasUpdateProcessorTest -Dtests.seed=BDFFAB212FC1DDCD
-Dtests.multiplier=2 -Dtests.nightly=true -Dtests.slow=true
-Dtests.linedocsfile=/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-7.x/test-data/enwiki.random.lines.txt
-Dtests.locale=ar-EG -Dtests.timezone=BET -Dtests.asserts=true
-Dtests.file.encoding=US-ASCII
[junit4] ERROR 0.00s J2 | TimeRoutedAliasUpdateProcessorTest (suite) <<<
[junit4] > Throwable #1:
com.carrotsearch.randomizedtesting.ThreadLeakError: 1 thread leaked from SUITE
scope at org.apache.solr.update.processor.TimeRoutedAliasUpdateProcessorTest:
[junit4] > 1) Thread[id=137, name=qtp980971333-137,
state=TIMED_WAITING, group=TGRP-TimeRoutedAliasUpdateProcessorTest]
[junit4] > at sun.misc.Unsafe.park(Native Method)
[junit4] > at
java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:215)
[junit4] > at
java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2163)
[junit4] > at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.reservedWait(ReservedThreadExecutor.java:308)
[junit4] > at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:373)
[junit4] > at
org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:708)
[junit4] > at
org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:626)
[junit4] > at java.lang.Thread.run(Thread.java:748)
[junit4] > at
__randomizedtesting.SeedInfo.seed([BDFFAB212FC1DDCD]:0)Throwable #2:
com.carrotsearch.randomizedtesting.ThreadLeakError: There are still zombie
threads that couldn't be terminated:
[junit4] > 1) Thread[id=137, name=qtp980971333-137,
state=TIMED_WAITING, group=TGRP-TimeRoutedAliasUpdateProcessorTest]
[junit4] > at sun.misc.Unsafe.park(Native Method)
[junit4] > at
java.util.concurrent.locks.LockSupport.parkNanos(LockSupport.java:215)
[junit4] > at
java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2163)
[junit4] > at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.reservedWait(ReservedThreadExecutor.java:308)
[junit4] > at
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:373)
[junit4] > at
org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:708)
[junit4] > at
org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:626)
[junit4] > at java.lang.Thread.run(Thread.java:748)
[junit4] > at
__randomizedtesting.SeedInfo.seed([BDFFAB212FC1DDCD]:0)
[junit4] Completed [13/777 (1!)] on J2 in 142.44s, 2 tests, 2 errors <<<
FAILURES!
[...truncated 50906 lines...]
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]