Build: https://jenkins.thetaphi.de/job/Lucene-Solr-8.x-Windows/1150/
Java: 64bit/jdk-15-ea+16 -XX:-UseCompressedOops
-XX:+UnlockExperimentalVMOptions -XX:+UseZGC
1 tests failed.
FAILED:
org.apache.solr.cloud.autoscaling.ScheduledTriggerIntegrationTest.testScheduledTrigger
Error Message:
ScheduledTrigger did not fire in time
Stack Trace:
java.lang.AssertionError: ScheduledTrigger did not fire in time
at
__randomizedtesting.SeedInfo.seed([9BB85A1D2F0D682D:8A3126F71F03319]:0)
at org.junit.Assert.fail(Assert.java:88)
at org.junit.Assert.assertTrue(Assert.java:41)
at
org.apache.solr.cloud.autoscaling.ScheduledTriggerIntegrationTest.testScheduledTrigger(ScheduledTriggerIntegrationTest.java:120)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.base/java.lang.reflect.Method.invoke(Method.java:564)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1750)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:938)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:974)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:988)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:947)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:832)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:883)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:894)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
at
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
at java.base/java.lang.Thread.run(Thread.java:832)
Build Log:
[...truncated 15639 lines...]
[junit4] Suite:
org.apache.solr.cloud.autoscaling.ScheduledTriggerIntegrationTest
[junit4] 2> 1744042 INFO
(SUITE-ScheduledTriggerIntegrationTest-seed#[9BB85A1D2F0D682D]-worker) [ ]
o.a.s.SolrTestCase Setting 'solr.default.confdir' system property to
test-framework derived value of
'C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\server\solr\configsets\_default\conf'
[junit4] 2> 1744042 INFO
(SUITE-ScheduledTriggerIntegrationTest-seed#[9BB85A1D2F0D682D]-worker) [ ]
o.a.s.SolrTestCaseJ4 SecureRandom sanity checks:
test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
[junit4] 2> 1744052 INFO
(SUITE-ScheduledTriggerIntegrationTest-seed#[9BB85A1D2F0D682D]-worker) [ ]
o.a.s.SolrTestCaseJ4 Created dataDir:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\data-dir-104-001
[junit4] 2> 1744053 INFO
(SUITE-ScheduledTriggerIntegrationTest-seed#[9BB85A1D2F0D682D]-worker) [ ]
o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true)
w/NUMERIC_DOCVALUES_SYSPROP=false
[junit4] 2> 1744055 INFO
(SUITE-ScheduledTriggerIntegrationTest-seed#[9BB85A1D2F0D682D]-worker) [ ]
o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (true) via:
@org.apache.solr.util.RandomizeSSL(reason="", value=0.0/0.0, ssl=0.0/0.0,
clientAuth=0.0/0.0)
[junit4] 2> 1744059 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.SolrTestCaseJ4 ###Starting testScheduledTrigger
[junit4] 2> 1744060 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.MiniSolrCloudCluster Starting cluster of 2 servers in
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\tempDir-001
[junit4] 2> 1744061 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
[junit4] 2> 1744061 INFO (ZkTestServer Run Thread) [ ]
o.a.s.c.ZkTestServer client port: 0.0.0.0/0.0.0.0:0
[junit4] 2> 1744061 INFO (ZkTestServer Run Thread) [ ]
o.a.s.c.ZkTestServer Starting server
[junit4] 2> 1744195 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkTestServer start zk server on port: 49605
[junit4] 2> 1744195 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkTestServer waitForServerUp: 127.0.0.1:49605
[junit4] 2> 1744195 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:49605
[junit4] 2> 1744195 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1 49605
[junit4] 2> 1744195 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1744206 INFO (zkConnectionManagerCallback-16219-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1744206 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1744210 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1744212 INFO (zkConnectionManagerCallback-16221-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1744212 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1744216 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1744221 INFO (zkConnectionManagerCallback-16223-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1744221 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1744359 WARN (jetty-launcher-16224-thread-2) [ ]
o.e.j.s.h.g.GzipHandler minGzipSize of 0 is inefficient for short content,
break even is size 23
[junit4] 2> 1744359 WARN (jetty-launcher-16224-thread-1) [ ]
o.e.j.s.h.g.GzipHandler minGzipSize of 0 is inefficient for short content,
break even is size 23
[junit4] 2> 1744359 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 1744359 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
[junit4] 2> 1744359 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 1744359 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
[junit4] 2> 1744360 INFO (jetty-launcher-16224-thread-1) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 15-ea+16-681
[junit4] 2> 1744360 INFO (jetty-launcher-16224-thread-2) [ ]
o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git:
a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 15-ea+16-681
[junit4] 2> 1744361 INFO (jetty-launcher-16224-thread-1) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 1744361 INFO (jetty-launcher-16224-thread-1) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 1744361 INFO (jetty-launcher-16224-thread-1) [ ]
o.e.j.s.session node0 Scavenging every 660000ms
[junit4] 2> 1744361 INFO (jetty-launcher-16224-thread-2) [ ]
o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 1744361 INFO (jetty-launcher-16224-thread-2) [ ]
o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 1744361 INFO (jetty-launcher-16224-thread-2) [ ]
o.e.j.s.session node0 Scavenging every 660000ms
[junit4] 2> 1744361 INFO (jetty-launcher-16224-thread-2) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@3dbb7317{/solr,null,AVAILABLE}
[junit4] 2> 1744361 INFO (jetty-launcher-16224-thread-1) [ ]
o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@67426274{/solr,null,AVAILABLE}
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-2) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@7c2092f8{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:49634}
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-1) [ ]
o.e.j.s.AbstractConnector Started ServerConnector@38844b6a{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:49633}
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-1) [ ]
o.e.j.s.Server Started @1681057ms
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-2) [ ]
o.e.j.s.Server Started @1681057ms
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr,
hostPort=49634}
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr,
hostPort=49633}
[junit4] 2> 1744363 ERROR (jetty-launcher-16224-thread-1) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 1744363 ERROR (jetty-launcher-16224-thread-2) [ ]
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be
missing or incomplete.
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version
8.6.0
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™ version
8.6.0
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on port null
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-05-20T11:50:19.684884700Z
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-05-20T11:50:19.684884700Z
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1744363 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1744368 INFO (zkConnectionManagerCallback-16228-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1744368 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1744368 INFO (zkConnectionManagerCallback-16226-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1744368 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1744369 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
[junit4] 2> 1744369 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
[junit4] 2> 1744699 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
[junit4] 2> 1744699 WARN (jetty-launcher-16224-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@7c659c96[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1744699 WARN (jetty-launcher-16224-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@7c659c96[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1744704 WARN (jetty-launcher-16224-thread-1) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@61edac20[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1744704 WARN (jetty-launcher-16224-thread-1) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@61edac20[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1744704 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:49605/solr
[junit4] 2> 1744704 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1744709 INFO (zkConnectionManagerCallback-16242-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1744709 INFO (jetty-launcher-16224-thread-1) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1744812 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
[junit4] 2> 1744814 WARN (jetty-launcher-16224-thread-2) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@53c80c37[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1744814 WARN (jetty-launcher-16224-thread-2) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@53c80c37[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1744818 WARN (jetty-launcher-16224-thread-2) [ ]
o.e.j.u.s.S.config Trusting all certificates configured for
Client@d840e4a[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1744818 WARN (jetty-launcher-16224-thread-2) [ ]
o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for
Client@d840e4a[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1744820 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:49605/solr
[junit4] 2> 1744820 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1744823 INFO (zkConnectionManagerCallback-16250-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1744823 INFO (jetty-launcher-16224-thread-2) [ ]
o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1744844 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ConnectionManager Waiting for client to
connect to ZooKeeper
[junit4] 2> 1744848 INFO (zkConnectionManagerCallback-16252-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1744848 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ConnectionManager Client is connected
to ZooKeeper
[junit4] 2> 1744959 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.c.OverseerElectionContext I am going to be
the leader 127.0.0.1:49633_solr
[junit4] 2> 1744959 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.c.Overseer Overseer
(id=72074787985096711-127.0.0.1:49633_solr-n_0000000000) starting
[junit4] 2> 1744966 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:49633_solr
[junit4] 2> 1744966 INFO
(OverseerStateUpdate-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[n:127.0.0.1:49633_solr ] o.a.s.c.Overseer Starting to work on the main
queue : 127.0.0.1:49633_solr
[junit4] 2> 1744966 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Adding .auto_add_replicas and
.scheduled_maintenance triggers
[junit4] 2> 1744966 INFO
(OverseerStateUpdate-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (1)
[junit4] 2> 1744967 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Refreshing /autoscaling.json with
znode version 1
[junit4] 2> 1744967 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Current znodeVersion 1,
lastZnodeVersion 0
[junit4] 2> 1744967 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Processed trigger updates upto
znodeVersion 1
[junit4] 2> 1744969 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.p.PackageLoader /packages.json updated to
version -1
[junit4] 2> 1744969 WARN (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.c.CoreContainer Not all security plugins
configured! authentication=disabled authorization=disabled. Solr is only as
secure as you make it. Consider configuring authentication/authorization before
exposing Solr to users internal or external. See
https://s.apache.org/solrsecurity for more info
[junit4] 2> 1744971 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial
livenodes: [127.0.0.1:49633_solr]
[junit4] 2> 1744971 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread -- deactivating old nodeLost /
nodeAdded markers
[junit4] 2> 1744971 DEBUG (ScheduledTrigger-16257-thread-1) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 1 and last live nodes: 1
[junit4] 2> 1744971 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Current znodeVersion 1,
lastZnodeVersion 1
[junit4] 2> 1744974 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.c.c.ConnectionManager Waiting for client to
connect to ZooKeeper
[junit4] 2> 1744977 INFO (zkConnectionManagerCallback-16261-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1744977 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.c.c.ConnectionManager Client is connected
to ZooKeeper
[junit4] 2> 1744983 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (1)
[junit4] 2> 1744987 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.c.ZkController Publish
node=127.0.0.1:49634_solr as DOWN
[junit4] 2> 1744988 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.c.TransientSolrCoreCacheDefault Allocating
transient cache for 2147483647 transient cores
[junit4] 2> 1744988 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:49634_solr
[junit4] 2> 1744988 INFO (zkCallback-16251-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 1744990 INFO (zkCallback-16260-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
[junit4] 2> 1744991 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.p.PackageLoader /packages.json updated to
version -1
[junit4] 2> 1744991 WARN (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.c.CoreContainer Not all security plugins
configured! authentication=disabled authorization=disabled. Solr is only as
secure as you make it. Consider configuring authentication/authorization before
exposing Solr to users internal or external. See
https://s.apache.org/solrsecurity for more info
[junit4] 2> 1745001 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.h.a.MetricsHistoryHandler No .system
collection, keeping metrics history in memory.
[junit4] 2> 1745022 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.h.a.MetricsHistoryHandler No .system
collection, keeping metrics history in memory.
[junit4] 2> 1745038 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_49633.solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@96d5a88
[junit4] 2> 1745045 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_49633.solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@96d5a88
[junit4] 2> 1745045 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_49633.solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@96d5a88
[junit4] 2> 1745047 INFO (jetty-launcher-16224-thread-1)
[n:127.0.0.1:49633_solr ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\tempDir-001\node1\.
[junit4] 2> 1745048 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_49634.solr.node' (registry 'solr.node') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@96d5a88
[junit4] 2> 1745054 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_49634.solr.jvm' (registry 'solr.jvm') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@96d5a88
[junit4] 2> 1745054 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.m.r.SolrJmxReporter JMX monitoring for
'solr_49634.solr.jetty' (registry 'solr.jetty') enabled at server:
com.sun.jmx.mbeanserver.JmxMBeanServer@96d5a88
[junit4] 2> 1745056 INFO (jetty-launcher-16224-thread-2)
[n:127.0.0.1:49634_solr ] o.a.s.c.CorePropertiesLocator Found 0 core
definitions underneath
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\tempDir-001\node2\.
[junit4] 2> 1745076 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.MiniSolrCloudCluster waitForAllNodes: numServers=2
[junit4] 2> 1745081 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1745081 INFO (zkConnectionManagerCallback-16279-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1745081 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1745088 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2)
[junit4] 2> 1745089 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at
127.0.0.1:49605/solr ready
[junit4] 2> 1745097 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling
params={wt=javabin&version=2} status=0 QTime=1
[junit4] 2> 1745112 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for
2147483647 transient cores
[junit4] 2> 1745117 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores&wt=javabin&version=2&group=solr.node}
status=0 QTime=8
[junit4] 2> 1745122 INFO (qtp1927770836-26816) [n:127.0.0.1:49634_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores&wt=javabin&version=2&group=solr.node}
status=0 QTime=3
[junit4] 2> 1745122 DEBUG (qtp910402514-26814) [n:127.0.0.1:49633_solr
] o.a.s.c.a.AutoScalingHandler Verified autoscaling configuration
[junit4] 2> 1745123 INFO (qtp910402514-26814) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/autoscaling
params={wt=javabin&version=2} status=0 QTime=15
[junit4] 2> 1745123 DEBUG (zkCallback-16251-thread-1) [ ]
o.a.s.c.a.OverseerTriggerThread Refreshing /autoscaling.json with znode version
2
[junit4] 2> 1745124 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Processed trigger updates upto
znodeVersion 2
[junit4] 2> 1745125 INFO (qtp910402514-26811) [n:127.0.0.1:49633_solr
] o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params
pullReplicas=0&maxShardsPerNode=5&name=testScheduledTrigger&nrtReplicas=3&action=CREATE&numShards=1&tlogReplicas=0&wt=javabin&version=2
and sendToOCPQueue=true
[junit4] 2> 1745126 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread -- deactivating old nodeLost /
nodeAdded markers
[junit4] 2> 1745127 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Current znodeVersion 2,
lastZnodeVersion 2
[junit4] 2> 1745128 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.a.c.CreateCollectionCmd Create collection
testScheduledTrigger
[junit4] 2> 1745129 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/managed-schema to
/configs/testScheduledTrigger.AUTOCREATED/managed-schema
[junit4] 2> 1745132 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/protwords.txt to
/configs/testScheduledTrigger.AUTOCREATED/protwords.txt
[junit4] 2> 1745134 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/contractions_it.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/contractions_it.txt
[junit4] 2> 1745136 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/contractions_ca.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/contractions_ca.txt
[junit4] 2> 1745138 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stemdict_nl.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stemdict_nl.txt
[junit4] 2> 1745139 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_hy.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_hy.txt
[junit4] 2> 1745141 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_no.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_no.txt
[junit4] 2> 1745143 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_id.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_id.txt
[junit4] 2> 1745144 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_et.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_et.txt
[junit4] 2> 1745146 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_da.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_da.txt
[junit4] 2> 1745149 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ga.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_ga.txt
[junit4] 2> 1745150 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_hi.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_hi.txt
[junit4] 2> 1745152 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ja.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_ja.txt
[junit4] 2> 1745155 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_pt.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_pt.txt
[junit4] 2> 1745157 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_hu.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_hu.txt
[junit4] 2> 1745159 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_el.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_el.txt
[junit4] 2> 1745161 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ru.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_ru.txt
[junit4] 2> 1745162 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_tr.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_tr.txt
[junit4] 2> 1745162 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ar.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_ar.txt
[junit4] 2> 1745162 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/userdict_ja.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/userdict_ja.txt
[junit4] 2> 1745168 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_eu.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_eu.txt
[junit4] 2> 1745170 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_it.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_it.txt
[junit4] 2> 1745172 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_cz.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_cz.txt
[junit4] 2> 1745173 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stoptags_ja.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stoptags_ja.txt
[junit4] 2> 1745177 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/contractions_fr.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/contractions_fr.txt
[junit4] 2> 1745179 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_de.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_de.txt
[junit4] 2> 1745181 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_fa.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_fa.txt
[junit4] 2> 1745184 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/contractions_ga.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/contractions_ga.txt
[junit4] 2> 1745185 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ca.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_ca.txt
[junit4] 2> 1745188 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_nl.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_nl.txt
[junit4] 2> 1745190 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_bg.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_bg.txt
[junit4] 2> 1745192 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_en.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_en.txt
[junit4] 2> 1745193 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_es.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_es.txt
[junit4] 2> 1745195 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_lv.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_lv.txt
[junit4] 2> 1745197 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_ro.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_ro.txt
[junit4] 2> 1745199 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_th.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_th.txt
[junit4] 2> 1745201 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_fr.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_fr.txt
[junit4] 2> 1745202 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_sv.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_sv.txt
[junit4] 2> 1745202 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_fi.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_fi.txt
[junit4] 2> 1745202 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/hyphenations_ga.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/hyphenations_ga.txt
[junit4] 2> 1745208 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/lang/stopwords_gl.txt to
/configs/testScheduledTrigger.AUTOCREATED/lang/stopwords_gl.txt
[junit4] 2> 1745210 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/solrconfig.xml to
/configs/testScheduledTrigger.AUTOCREATED/solrconfig.xml
[junit4] 2> 1745212 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/synonyms.txt to
/configs/testScheduledTrigger.AUTOCREATED/synonyms.txt
[junit4] 2> 1745214 INFO
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.c.ZkConfigManager Copying zk node
/configs/_default/stopwords.txt to
/configs/testScheduledTrigger.AUTOCREATED/stopwords.txt
[junit4] 2> 1745352 WARN
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.a.c.CreateCollectionCmd Specified number
of replicas of 3 on collection testScheduledTrigger is higher than the number
of Solr instances currently live or live and part of your createNodeSet(2).
It's unusual to run two replica of the same slice on the same Solr-instance.
[junit4] 2> 1745354 DEBUG
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.s.c.a.PolicyHelper Creating a new session
[junit4] 2> 1745360 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores&wt=javabin&version=2&group=solr.node}
status=0 QTime=3
[junit4] 2> 1745365 INFO (qtp1927770836-26817) [n:127.0.0.1:49634_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores&wt=javabin&version=2&group=solr.node}
status=0 QTime=3
[junit4] 2> 1745365 DEBUG
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.s.c.a.PolicyHelper New session created
[junit4] 2> 1745368 INFO (qtp910402514-26814) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores&wt=javabin&version=2&group=solr.node}
status=0 QTime=1
[junit4] 2> 1745369 INFO (qtp1927770836-26812) [n:127.0.0.1:49634_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores&wt=javabin&version=2&group=solr.node}
status=0 QTime=1
[junit4] 2> 1745374 DEBUG
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.s.c.a.PolicyHelper returnSession,
curr-time 262359811 sessionWrapper.createTime 262359804851999,
this.sessionWrapper.createTime 262359804851999
[junit4] 2> 1745379 INFO
(OverseerStateUpdate-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[n:127.0.0.1:49633_solr ] o.a.s.c.o.SliceMutator createReplica() {
[junit4] 2> "operation":"ADDREPLICA",
[junit4] 2> "collection":"testScheduledTrigger",
[junit4] 2> "shard":"shard1",
[junit4] 2> "core":"testScheduledTrigger_shard1_replica_n1",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:49634/solr";,
[junit4] 2> "node_name":"127.0.0.1:49634_solr",
[junit4] 2> "type":"NRT",
[junit4] 2> "waitForFinalState":"false"}
[junit4] 2> 1745381 INFO
(OverseerStateUpdate-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[n:127.0.0.1:49633_solr ] o.a.s.c.o.SliceMutator createReplica() {
[junit4] 2> "operation":"ADDREPLICA",
[junit4] 2> "collection":"testScheduledTrigger",
[junit4] 2> "shard":"shard1",
[junit4] 2> "core":"testScheduledTrigger_shard1_replica_n2",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:49633/solr";,
[junit4] 2> "node_name":"127.0.0.1:49633_solr",
[junit4] 2> "type":"NRT",
[junit4] 2> "waitForFinalState":"false"}
[junit4] 2> 1745384 INFO
(OverseerStateUpdate-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[n:127.0.0.1:49633_solr ] o.a.s.c.o.SliceMutator createReplica() {
[junit4] 2> "operation":"ADDREPLICA",
[junit4] 2> "collection":"testScheduledTrigger",
[junit4] 2> "shard":"shard1",
[junit4] 2> "core":"testScheduledTrigger_shard1_replica_n4",
[junit4] 2> "state":"down",
[junit4] 2> "base_url":"http://127.0.0.1:49633/solr";,
[junit4] 2> "node_name":"127.0.0.1:49633_solr",
[junit4] 2> "type":"NRT",
[junit4] 2> "waitForFinalState":"false"}
[junit4] 2> 1745649 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.h.a.CoreAdminOperation core
create command
qt=/admin/cores&coreNodeName=core_node5&collection.configName=testScheduledTrigger.AUTOCREATED&newCollection=true&name=testScheduledTrigger_shard1_replica_n2&action=CREATE&numShards=1&collection=testScheduledTrigger&shard=shard1&wt=javabin&version=2&replicaType=NRT
[junit4] 2> 1745649 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.h.a.CoreAdminOperation core
create command
qt=/admin/cores&coreNodeName=core_node6&collection.configName=testScheduledTrigger.AUTOCREATED&newCollection=true&name=testScheduledTrigger_shard1_replica_n4&action=CREATE&numShards=1&collection=testScheduledTrigger&shard=shard1&wt=javabin&version=2&replicaType=NRT
[junit4] 2> 1745649 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core
create command
qt=/admin/cores&coreNodeName=core_node3&collection.configName=testScheduledTrigger.AUTOCREATED&newCollection=true&name=testScheduledTrigger_shard1_replica_n1&action=CREATE&numShards=1&collection=testScheduledTrigger&shard=shard1&wt=javabin&version=2&replicaType=NRT
[junit4] 2> 1745669 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.SolrConfig Using Lucene
MatchVersion: 8.6.0
[junit4] 2> 1745669 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.c.SolrConfig Using Lucene
MatchVersion: 8.6.0
[junit4] 2> 1745669 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.c.SolrConfig Using Lucene
MatchVersion: 8.6.0
[junit4] 2> 1745696 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.s.IndexSchema Schema
name=default-config
[junit4] 2> 1745697 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.s.IndexSchema Schema
name=default-config
[junit4] 2> 1745697 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.s.IndexSchema Schema
name=default-config
[junit4] 2> 1746086 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.s.IndexSchema Loaded schema
default-config/1.6 with uniqueid field id
[junit4] 2> 1746096 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.s.IndexSchema Loaded schema
default-config/1.6 with uniqueid field id
[junit4] 2> 1746099 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.s.IndexSchema Loaded schema
default-config/1.6 with uniqueid field id
[junit4] 2> 1746154 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.c.CoreContainer Creating
SolrCore 'testScheduledTrigger_shard1_replica_n2' using configuration from
configset testScheduledTrigger.AUTOCREATED, trusted=true
[junit4] 2> 1746164 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.c.CoreContainer Creating
SolrCore 'testScheduledTrigger_shard1_replica_n1' using configuration from
configset testScheduledTrigger.AUTOCREATED, trusted=true
[junit4] 2> 1746166 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.CoreContainer Creating
SolrCore 'testScheduledTrigger_shard1_replica_n4' using configuration from
configset testScheduledTrigger.AUTOCREATED, trusted=true
[junit4] 2> 1746169 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.m.r.SolrJmxReporter JMX
monitoring for 'solr_49633.solr.core.testScheduledTrigger.shard1.replica_n2'
(registry 'solr.core.testScheduledTrigger.shard1.replica_n2') enabled at
server: com.sun.jmx.mbeanserver.JmxMBeanServer@96d5a88
[junit4] 2> 1746169 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.m.r.SolrJmxReporter JMX
monitoring for 'solr_49633.solr.core.testScheduledTrigger.shard1.replica_n4'
(registry 'solr.core.testScheduledTrigger.shard1.replica_n4') enabled at
server: com.sun.jmx.mbeanserver.JmxMBeanServer@96d5a88
[junit4] 2> 1746169 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.c.SolrCore
[[testScheduledTrigger_shard1_replica_n2] ] Opening new SolrCore at
[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\tempDir-001\node1\.\testScheduledTrigger_shard1_replica_n2],
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\tempDir-001\node1\.\testScheduledTrigger_shard1_replica_n2\data\]
[junit4] 2> 1746169 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.SolrCore
[[testScheduledTrigger_shard1_replica_n4] ] Opening new SolrCore at
[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\tempDir-001\node1\.\testScheduledTrigger_shard1_replica_n4],
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\tempDir-001\node1\.\testScheduledTrigger_shard1_replica_n4\data\]
[junit4] 2> 1746169 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.m.r.SolrJmxReporter JMX
monitoring for 'solr_49634.solr.core.testScheduledTrigger.shard1.replica_n1'
(registry 'solr.core.testScheduledTrigger.shard1.replica_n1') enabled at
server: com.sun.jmx.mbeanserver.JmxMBeanServer@96d5a88
[junit4] 2> 1746169 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.c.SolrCore
[[testScheduledTrigger_shard1_replica_n1] ] Opening new SolrCore at
[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\tempDir-001\node2\.\testScheduledTrigger_shard1_replica_n1],
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001\tempDir-001\node2\.\testScheduledTrigger_shard1_replica_n1\data\]
[junit4] 2> 1746277 DEBUG (ScheduledTrigger-16257-thread-2) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 2 and last live nodes: 1
[junit4] 2> 1746331 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.u.UpdateHandler Using
UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 1746331 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.u.UpdateLog Initializing
UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100
maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 1746336 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.u.UpdateHandler Using
UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 1746336 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.u.UpdateLog Initializing
UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100
maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 1746336 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.u.CommitTracker Hard
AutoCommit: if uncommitted for 15000ms;
[junit4] 2> 1746336 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.u.CommitTracker Soft
AutoCommit: disabled
[junit4] 2> 1746338 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.u.CommitTracker Hard
AutoCommit: if uncommitted for 15000ms;
[junit4] 2> 1746338 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.u.CommitTracker Soft
AutoCommit: disabled
[junit4] 2> 1746340 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.r.ManagedResourceStorage
Configured ZooKeeperStorageIO with znodeBase:
/configs/testScheduledTrigger.AUTOCREATED
[junit4] 2> 1746340 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.r.ManagedResourceStorage
Configured ZooKeeperStorageIO with znodeBase:
/configs/testScheduledTrigger.AUTOCREATED
[junit4] 2> 1746340 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.r.ManagedResourceStorage
Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/testScheduledTrigger.AUTOCREATED
[junit4] 2> 1746340 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.s.ZkIndexSchemaReader Creating
ZooKeeper watch for the managed schema at
/configs/testScheduledTrigger.AUTOCREATED/managed-schema
[junit4] 2> 1746340 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.r.ManagedResourceStorage
Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/testScheduledTrigger.AUTOCREATED
[junit4] 2> 1746340 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.s.ZkIndexSchemaReader Creating
ZooKeeper watch for the managed schema at
/configs/testScheduledTrigger.AUTOCREATED/managed-schema
[junit4] 2> 1746341 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.s.ZkIndexSchemaReader Current
schema version 0 is already the latest
[junit4] 2> 1746341 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.s.ZkIndexSchemaReader Current
schema version 0 is already the latest
[junit4] 2> 1746341 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.h.c.SpellCheckComponent
Initializing spell checkers
[junit4] 2> 1746341 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] 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> 1746341 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.h.c.SpellCheckComponent
Initializing spell checkers
[junit4] 2> 1746341 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] 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> 1746341 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.h.ReplicationHandler Commits
will be reserved for 10000 ms
[junit4] 2> 1746343 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.u.UpdateLog Could not find max
version in index or recent updates, using new clock 1667210067746750464
[junit4] 2> 1746343 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.h.ReplicationHandler Commits
will be reserved for 10000 ms
[junit4] 2> 1746343 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.u.UpdateLog Could not find max
version in index or recent updates, using new clock 1667210067746750464
[junit4] 2> 1746345 INFO
(searcherExecutor-16285-thread-1-processing-n:127.0.0.1:49633_solr
x:testScheduledTrigger_shard1_replica_n4 c:testScheduledTrigger s:shard1
r:core_node6) [n:127.0.0.1:49633_solr c:testScheduledTrigger s:shard1
r:core_node6 x:testScheduledTrigger_shard1_replica_n4 ]
o.a.s.c.QuerySenderListener QuerySenderListener done.
[junit4] 2> 1746345 INFO
(searcherExecutor-16281-thread-1-processing-n:127.0.0.1:49633_solr
x:testScheduledTrigger_shard1_replica_n2 c:testScheduledTrigger s:shard1
r:core_node5) [n:127.0.0.1:49633_solr c:testScheduledTrigger s:shard1
r:core_node5 x:testScheduledTrigger_shard1_replica_n2 ]
o.a.s.c.QuerySenderListener QuerySenderListener done.
[junit4] 2> 1746345 INFO
(searcherExecutor-16285-thread-1-processing-n:127.0.0.1:49633_solr
x:testScheduledTrigger_shard1_replica_n4 c:testScheduledTrigger s:shard1
r:core_node6) [n:127.0.0.1:49633_solr c:testScheduledTrigger s:shard1
r:core_node6 x:testScheduledTrigger_shard1_replica_n4 ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
[junit4] 2> 1746345 INFO
(searcherExecutor-16281-thread-1-processing-n:127.0.0.1:49633_solr
x:testScheduledTrigger_shard1_replica_n2 c:testScheduledTrigger s:shard1
r:core_node5) [n:127.0.0.1:49633_solr c:testScheduledTrigger s:shard1
r:core_node5 x:testScheduledTrigger_shard1_replica_n2 ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
[junit4] 2> 1746345 INFO
(searcherExecutor-16285-thread-1-processing-n:127.0.0.1:49633_solr
x:testScheduledTrigger_shard1_replica_n4 c:testScheduledTrigger s:shard1
r:core_node6) [n:127.0.0.1:49633_solr c:testScheduledTrigger s:shard1
r:core_node6 x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.SolrCore
[testScheduledTrigger_shard1_replica_n4] Registered new searcher autowarm
time: 0 ms: Collection: 'testScheduledTrigger'
[junit4] 2> 1746347 INFO
(searcherExecutor-16281-thread-1-processing-n:127.0.0.1:49633_solr
x:testScheduledTrigger_shard1_replica_n2 c:testScheduledTrigger s:shard1
r:core_node5) [n:127.0.0.1:49633_solr c:testScheduledTrigger s:shard1
r:core_node5 x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.c.SolrCore
[testScheduledTrigger_shard1_replica_n2] Registered new searcher autowarm
time: 0 ms: Collection: 'testScheduledTrigger'
[junit4] 2> 1746349 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.ZkShardTerms Successful
update of terms at /collections/testScheduledTrigger/terms/shard1 to
Terms{values={core_node6=0}, version=0}
[junit4] 2> 1746349 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.u.UpdateHandler Using
UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 1746349 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.u.UpdateLog Initializing
UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100
maxNumLogsToKeep=10 numVersionBuckets=65536
[junit4] 2> 1746349 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/testScheduledTrigger/leaders/shard1
[junit4] 2> 1746349 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.c.ZkShardTerms Successful
update of terms at /collections/testScheduledTrigger/terms/shard1 to
Terms{values={core_node6=0, core_node5=0}, version=1}
[junit4] 2> 1746349 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/testScheduledTrigger/leaders/shard1
[junit4] 2> 1746353 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.u.CommitTracker Hard
AutoCommit: if uncommitted for 15000ms;
[junit4] 2> 1746353 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.u.CommitTracker Soft
AutoCommit: disabled
[junit4] 2> 1746355 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContext
Waiting until we see more replicas up for shard shard1: total=3 found=2
timeoute in=9999ms
[junit4] 2> 1746356 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage
Configured ZooKeeperStorageIO with znodeBase:
/configs/testScheduledTrigger.AUTOCREATED
[junit4] 2> 1746356 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage
Loaded null at path _rest_managed.json using
ZooKeeperStorageIO:path=/configs/testScheduledTrigger.AUTOCREATED
[junit4] 2> 1746356 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Creating
ZooKeeper watch for the managed schema at
/configs/testScheduledTrigger.AUTOCREATED/managed-schema
[junit4] 2> 1746357 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Current
schema version 0 is already the latest
[junit4] 2> 1746358 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.h.c.SpellCheckComponent
Initializing spell checkers
[junit4] 2> 1746358 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_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> 1746359 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.h.ReplicationHandler Commits
will be reserved for 10000 ms
[junit4] 2> 1746359 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.u.UpdateLog Could not find max
version in index or recent updates, using new clock 1667210067763527680
[junit4] 2> 1746361 INFO
(searcherExecutor-16283-thread-1-processing-n:127.0.0.1:49634_solr
x:testScheduledTrigger_shard1_replica_n1 c:testScheduledTrigger s:shard1
r:core_node3) [n:127.0.0.1:49634_solr c:testScheduledTrigger s:shard1
r:core_node3 x:testScheduledTrigger_shard1_replica_n1 ]
o.a.s.c.QuerySenderListener QuerySenderListener done.
[junit4] 2> 1746361 INFO
(searcherExecutor-16283-thread-1-processing-n:127.0.0.1:49634_solr
x:testScheduledTrigger_shard1_replica_n1 c:testScheduledTrigger s:shard1
r:core_node3) [n:127.0.0.1:49634_solr c:testScheduledTrigger s:shard1
r:core_node3 x:testScheduledTrigger_shard1_replica_n1 ]
o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
[junit4] 2> 1746361 INFO
(searcherExecutor-16283-thread-1-processing-n:127.0.0.1:49634_solr
x:testScheduledTrigger_shard1_replica_n1 c:testScheduledTrigger s:shard1
r:core_node3) [n:127.0.0.1:49634_solr c:testScheduledTrigger s:shard1
r:core_node3 x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.c.SolrCore
[testScheduledTrigger_shard1_replica_n1] Registered new searcher autowarm
time: 0 ms: Collection: 'testScheduledTrigger'
[junit4] 2> 1746364 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.c.ZkShardTerms Successful
update of terms at /collections/testScheduledTrigger/terms/shard1 to
Terms{values={core_node6=0, core_node3=0, core_node5=0}, version=2}
[junit4] 2> 1746364 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ]
o.a.s.c.ShardLeaderElectionContextBase make sure parent is created
/collections/testScheduledTrigger/leaders/shard1
[junit4] 2> 1747008 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContext
Enough replicas found to continue.
[junit4] 2> 1747008 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContext I
may be the new leader - try and sync
[junit4] 2> 1747008 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.SyncStrategy Sync replicas
to http://127.0.0.1:49633/solr/testScheduledTrigger_shard1_replica_n4/
[junit4] 2> 1747009 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.u.PeerSync PeerSync:
core=testScheduledTrigger_shard1_replica_n4 url=http://127.0.0.1:49633/solr
START
replicas=[http://127.0.0.1:49634/solr/testScheduledTrigger_shard1_replica_n1/,
http://127.0.0.1:49633/solr/testScheduledTrigger_shard1_replica_n2/]
nUpdates=100
[junit4] 2> 1747009 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.u.PeerSync PeerSync:
core=testScheduledTrigger_shard1_replica_n4 url=http://127.0.0.1:49633/solr
DONE. We have no versions. sync failed.
[junit4] 2> 1747011 INFO (qtp910402514-26814) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node5
x:testScheduledTrigger_shard1_replica_n2 ] o.a.s.c.S.Request
[testScheduledTrigger_shard1_replica_n2] webapp=/solr path=/get
params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2}
status=0 QTime=0
[junit4] 2> 1747011 INFO (qtp1927770836-26817) [n:127.0.0.1:49634_solr
c:testScheduledTrigger s:shard1 r:core_node3
x:testScheduledTrigger_shard1_replica_n1 ] o.a.s.c.S.Request
[testScheduledTrigger_shard1_replica_n1] webapp=/solr path=/get
params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2}
status=0 QTime=0
[junit4] 2> 1747012 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.SyncStrategy Leader's
attempt to sync with shard failed, moving to the next candidate
[junit4] 2> 1747012 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContext
We failed sync, but we have no versions - we can't sync in that case - we were
active before, so become leader anyway
[junit4] 2> 1747012 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ]
o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node
/collections/testScheduledTrigger/leaders/shard1/leader after winning as
/collections/testScheduledTrigger/leader_elect/shard1/election/72074787985096711-core_node6-n_0000000000
[junit4] 2> 1747013 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContext I
am the new leader:
http://127.0.0.1:49633/solr/testScheduledTrigger_shard1_replica_n4/ shard1
[junit4] 2> 1747146 INFO (zkCallback-16251-thread-1) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/testScheduledTrigger/state.json] for collection
[testScheduledTrigger] has occurred - updating... (live nodes size: [2])
[junit4] 2> 1747148 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
c:testScheduledTrigger s:shard1 r:core_node6
x:testScheduledTrigger_shard1_replica_n4 ] o.a.s.c.ZkController I am the
leader, no recovery necessary
[junit4] 2> 1747154 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores
params={qt=/admin/cores&coreNodeName=core_node6&collection.configName=testScheduledTrigger.AUTOCREATED&newCollection=true&name=testScheduledTrigger_shard1_replica_n4&action=CREATE&numShards=1&collection=testScheduledTrigger&shard=shard1&wt=javabin&version=2&replicaType=NRT}
status=0 QTime=1155
[junit4] 2> 1747282 INFO (zkCallback-16251-thread-2) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/testScheduledTrigger/state.json] for collection
[testScheduledTrigger] has occurred - updating... (live nodes size: [2])
[junit4] 2> 1747282 INFO (zkCallback-16251-thread-1) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/testScheduledTrigger/state.json] for collection
[testScheduledTrigger] has occurred - updating... (live nodes size: [2])
[junit4] 2> 1747564 DEBUG (ScheduledTrigger-16257-thread-2) [ ]
o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with
currently live nodes: 2 and last live nodes: 2
[junit4] 2> 1747637 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores
params={qt=/admin/cores&coreNodeName=core_node5&collection.configName=testScheduledTrigger.AUTOCREATED&newCollection=true&name=testScheduledTrigger_shard1_replica_n2&action=CREATE&numShards=1&collection=testScheduledTrigger&shard=shard1&wt=javabin&version=2&replicaType=NRT}
status=0 QTime=1547
[junit4] 2> 1747648 INFO (qtp1927770836-26810) [n:127.0.0.1:49634_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores
params={qt=/admin/cores&coreNodeName=core_node3&collection.configName=testScheduledTrigger.AUTOCREATED&newCollection=true&name=testScheduledTrigger_shard1_replica_n1&action=CREATE&numShards=1&collection=testScheduledTrigger&shard=shard1&wt=javabin&version=2&replicaType=NRT}
status=0 QTime=1556
[junit4] 2> 1747649 DEBUG
(OverseerThreadFactory-16259-thread-1-processing-n:127.0.0.1:49633_solr)
[n:127.0.0.1:49633_solr ] o.a.s.c.s.c.a.PolicyHelper session set to NULL
[junit4] 2> 1747650 INFO (qtp910402514-26811) [n:127.0.0.1:49633_solr
] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most
45 seconds. Check all shard replicas
[junit4] 2> 1747703 INFO
(OverseerCollectionConfigSetProcessor-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[n:127.0.0.1:49633_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> 1747764 INFO (zkCallback-16251-thread-3) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/testScheduledTrigger/state.json] for collection
[testScheduledTrigger] has occurred - updating... (live nodes size: [2])
[junit4] 2> 1747764 INFO (zkCallback-16251-thread-2) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/testScheduledTrigger/state.json] for collection
[testScheduledTrigger] has occurred - updating... (live nodes size: [2])
[junit4] 2> 1747764 INFO (zkCallback-16260-thread-1) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/testScheduledTrigger/state.json] for collection
[testScheduledTrigger] has occurred - updating... (live nodes size: [2])
[junit4] 2> 1747764 INFO (zkCallback-16260-thread-2) [ ]
o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent
state:SyncConnected type:NodeDataChanged
path:/collections/testScheduledTrigger/state.json] for collection
[testScheduledTrigger] has occurred - updating... (live nodes size: [2])
[junit4] 2> 1747764 INFO (qtp910402514-26811) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections
params={pullReplicas=0&maxShardsPerNode=5&name=testScheduledTrigger&nrtReplicas=3&action=CREATE&numShards=1&tlogReplicas=0&wt=javabin&version=2}
status=0 QTime=2057
[junit4] 2> 1747765 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.MiniSolrCloudCluster waitForActiveCollection:
testScheduledTrigger
[junit4] 2> 1747768 INFO (qtp910402514-26813) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={wt=javabin&version=2&key=solr.core.testScheduledTrigger.shard1.replica_n2:INDEX.sizeInBytes&key=solr.core.testScheduledTrigger.shard1.replica_n4:INDEX.sizeInBytes}
status=0 QTime=0
[junit4] 2> 1747770 INFO (qtp910402514-26815) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CONTAINER.cores&wt=javabin&version=2&group=solr.node}
status=0 QTime=1
[junit4] 2> 1747771 INFO (qtp1927770836-26812) [n:127.0.0.1:49634_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={wt=javabin&version=2&key=solr.core.testScheduledTrigger.shard1.replica_n1:INDEX.sizeInBytes}
status=0 QTime=0
[junit4] 2> 1747773 INFO (qtp1927770836-26816) [n:127.0.0.1:49634_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics
params={prefix=CONTAINER.fs.usableSpace,CONTAINER.cores&wt=javabin&version=2&group=solr.node}
status=0 QTime=1
[junit4] 2> 1747773 DEBUG (qtp910402514-26814) [n:127.0.0.1:49633_solr
] o.a.s.c.a.AutoScalingHandler Verified autoscaling configuration
[junit4] 2> 1747773 INFO (qtp910402514-26814) [n:127.0.0.1:49633_solr
] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/autoscaling
params={wt=javabin&version=2} status=0 QTime=5
[junit4] 2> 1747774 DEBUG (zkCallback-16251-thread-2) [ ]
o.a.s.c.a.OverseerTriggerThread Refreshing /autoscaling.json with znode version
3
[junit4] 2> 1747774 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Processed trigger updates upto
znodeVersion 3
[junit4] 2> 1747774 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread -- deactivating old nodeLost /
nodeAdded markers
[junit4] 2> 1747775 WARN
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.s.h.g.GzipHandler minGzipSize of 0 is inefficient for short
content, break even is size 23
[junit4] 2> 1747775 DEBUG
(OverseerAutoScalingTriggerThread-72074787985096711-127.0.0.1:49633_solr-n_0000000000)
[ ] o.a.s.c.a.OverseerTriggerThread Current znodeVersion 3,
lastZnodeVersion 3
[junit4] 2> 1747775 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding
port=0)
[junit4] 2> 1747775 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number
2 ...
[junit4] 2> 1747775 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.s.Server jetty-9.4.27.v20200227; built:
2020-02-27T18:37:21.340Z; git: a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm
15-ea+16-681
[junit4] 2> 1747775 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.s.session DefaultSessionIdManager workerName=node0
[junit4] 2> 1747775 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.s.session No SessionScavenger set, using defaults
[junit4] 2> 1747775 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.s.session node0 Scavenging every 660000ms
[junit4] 2> 1747776 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.s.h.ContextHandler Started
o.e.j.s.ServletContextHandler@83e30c0{/solr,null,AVAILABLE}
[junit4] 2> 1747777 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.s.AbstractConnector Started ServerConnector@525ec1b8{HTTP/1.1,
(http/1.1, h2c)}{127.0.0.1:49698}
[junit4] 2> 1747777 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.s.Server Started @1683710ms
[junit4] 2> 1747777 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr,
hostPort=49698}
[junit4] 2> 1747778 ERROR
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging
may be missing or incomplete.
[junit4] 2> 1747778 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.s.SolrDispatchFilter Using logger factory
org.apache.logging.slf4j.Log4jLoggerFactory
[junit4] 2> 1747778 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.s.SolrDispatchFilter ___ _ Welcome to Apache Solr™
version 8.6.0
[junit4] 2> 1747778 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _ Starting in cloud mode on
port null
[junit4] 2> 1747778 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_| Install dir:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr
[junit4] 2> 1747778 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.s.SolrDispatchFilter |___/\___/_|_| Start time:
2020-05-20T11:50:23.099487700Z
[junit4] 2> 1747779 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1747780 INFO (zkConnectionManagerCallback-16299-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1747780 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1747780 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
[junit4] 2> 1747984 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized:
WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
[junit4] 2> 1747986 WARN
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.u.s.S.config Trusting all certificates configured for
Client@7c615bd[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1747986 WARN
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm
configured for Client@7c615bd[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1747989 WARN
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.u.s.S.config Trusting all certificates configured for
Client@6d568763[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1747989 WARN
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm
configured for Client@6d568763[provider=null,keyStore=null,trustStore=null]
[junit4] 2> 1747990 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:49605/solr
[junit4] 2> 1747991 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
[junit4] 2> 1747995 INFO (zkConnectionManagerCallback-16310-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1747995 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
[junit4] 2> 1748116 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[n:127.0.0.1:49698_solr ] o.a.s.c.c.ConnectionManager Waiting for client
to connect to ZooKeeper
[junit4] 2> 1748119 INFO (zkConnectionManagerCallback-16312-thread-1) [
] o.a.s.c.c.ConnectionManager zkClient has connected
[junit4] 2> 1748119 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[n:127.0.0.1:49698_solr ] o.a.s.c.c.ConnectionManager Client is connected
to ZooKeeper
[junit4] 2> 1748124 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[n:127.0.0.1:49698_solr ] o.a.s.c.c.ZkStateReader Updated live nodes from
ZooKeeper... (0) -> (2)
[junit4] 2> 1748127 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[n:127.0.0.1:49698_solr ] o.a.s.c.ZkController Publish
node=127.0.0.1:49698_solr as DOWN
[junit4] 2> 1748128 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[n:127.0.0.1:49698_solr ] o.a.s.c.TransientSolrCoreCacheDefault Allocating
transient cache for 2147483647 transient cores
[junit4] 2> 1748128 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[n:127.0.0.1:49698_solr ] o.a.s.c.ZkController Register node as live in
ZooKeeper:/live_nodes/127.0.0.1:49698_solr
[junit4] 2> 1748129 INFO (zkCallback-16260-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 1748129 INFO (zkCallback-16278-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 1748129 INFO (zkCallback-16251-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 1748130 INFO (zkCallback-16311-thread-1) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (3)
[junit4] 2> 1748132 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[n:127.0.0.1:49698_solr ] o.a.s.p.PackageLoader /packages.json updated to
version -1
[junit4] 2> 1748132 WARN
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[n:127.0.0.1:49698_solr ] o.a.s.c.CoreContainer Not all security plugins
configured! authentication=disabled authorization=disabled. Solr is only as
secure as you make it. Consider configuring authentication/authorization before
exposing Solr to users internal or external. See
https://s.apache.org/solrsecurity for more info
[junit4] 2> 1748159 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[n:127.0.0.1:49698_solr ] o.a.s.
[...truncated too long message...]
eadPool-16338-thread-2) [ ] o.a.s.c.a.OverseerTriggerThread
OverseerTriggerThread has been closed explicitly
[junit4] 2> 1792226 INFO (closeThreadPool-16338-thread-1) [ ]
o.a.s.c.Overseer Overseer
(id=72074787985096711-127.0.0.1:49633_solr-n_0000000000) closing
[junit4] 2> 1792290 INFO (zkCallback-16251-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (2)
[junit4] 2> 1792290 INFO (zkCallback-16260-thread-2) [ ]
o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (3) -> (2)
[junit4] 2> 1792290 INFO (jetty-closer-16321-thread-3) [ ]
o.e.j.s.AbstractConnector Stopped ServerConnector@525ec1b8{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:0}
[junit4] 2> 1792290 INFO (jetty-closer-16321-thread-3) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.s.ServletContextHandler@83e30c0{/solr,null,UNAVAILABLE}
[junit4] 2> 1792290 INFO (jetty-closer-16321-thread-3) [ ]
o.e.j.s.session node0 Stopped scavenging
[junit4] 2> 1792371 INFO (jetty-closer-16321-thread-2) [ ]
o.e.j.s.AbstractConnector Stopped ServerConnector@7c2092f8{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:0}
[junit4] 2> 1792371 INFO (jetty-closer-16321-thread-2) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.s.ServletContextHandler@3dbb7317{/solr,null,UNAVAILABLE}
[junit4] 2> 1792371 INFO (jetty-closer-16321-thread-2) [ ]
o.e.j.s.session node0 Stopped scavenging
[junit4] 2> 1792448 INFO (jetty-closer-16321-thread-1) [ ]
o.a.s.c.Overseer Overseer
(id=72074787985096711-127.0.0.1:49633_solr-n_0000000000) closing
[junit4] 2> 1792449 INFO (jetty-closer-16321-thread-1) [ ]
o.e.j.s.AbstractConnector Stopped ServerConnector@38844b6a{HTTP/1.1, (http/1.1,
h2c)}{127.0.0.1:0}
[junit4] 2> 1792449 INFO (jetty-closer-16321-thread-1) [ ]
o.e.j.s.h.ContextHandler Stopped
o.e.j.s.ServletContextHandler@67426274{/solr,null,UNAVAILABLE}
[junit4] 2> 1792449 INFO (jetty-closer-16321-thread-1) [ ]
o.e.j.s.session node0 Stopped scavenging
[junit4] 2> 1792450 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkTestServer Shutting down ZkTestServer.
[junit4] 2> 1792607 WARN (ZkTestServer Run Thread) [ ]
o.a.s.c.ZkTestServer Watch limit violations:
[junit4] 2> Maximum concurrent create/delete watches above limit:
[junit4] 2>
[junit4] 2> 6
/solr/collections/testScheduledTrigger/terms/shard1
[junit4] 2> 4 /solr/aliases.json
[junit4] 2> 4 /solr/clusterprops.json
[junit4] 2> 3
/solr/configs/testScheduledTrigger.AUTOCREATED/managed-schema
[junit4] 2> 3 /solr/packages.json
[junit4] 2> 3 /solr/security.json
[junit4] 2> 2 /solr/configs/testScheduledTrigger.AUTOCREATED
[junit4] 2>
[junit4] 2> Maximum concurrent data watches above limit:
[junit4] 2>
[junit4] 2> 20
/solr/collections/testScheduledTrigger/state.json
[junit4] 2> 4 /solr/clusterstate.json
[junit4] 2> 4 /solr/autoscaling.json
[junit4] 2>
[junit4] 2> Maximum concurrent children watches above limit:
[junit4] 2>
[junit4] 2> 24 /solr/overseer/queue
[junit4] 2> 13 /solr/live_nodes
[junit4] 2> 7 /solr/collections
[junit4] 2> 5 /solr/overseer/collection-queue-work
[junit4] 2>
[junit4] 2> 1792611 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkTestServer waitForServerDown: 127.0.0.1:49605
[junit4] 2> 1792611 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:49605
[junit4] 2> 1792611 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.c.ZkTestServer connecting to 127.0.0.1 49605
[junit4] 2> 1794156 INFO
(TEST-ScheduledTriggerIntegrationTest.testScheduledTrigger-seed#[9BB85A1D2F0D682D])
[ ] o.a.s.SolrTestCaseJ4 ###Ending testScheduledTrigger
[junit4] 2> NOTE: reproduce with: ant test
-Dtestcase=ScheduledTriggerIntegrationTest -Dtests.method=testScheduledTrigger
-Dtests.seed=9BB85A1D2F0D682D -Dtests.slow=true -Dtests.locale=kea-CV
-Dtests.timezone=SystemV/AST4 -Dtests.asserts=true -Dtests.file.encoding=Cp1252
[junit4] FAILURE 50.1s J2 |
ScheduledTriggerIntegrationTest.testScheduledTrigger <<<
[junit4] > Throwable #1: java.lang.AssertionError: ScheduledTrigger did
not fire in time
[junit4] > at
__randomizedtesting.SeedInfo.seed([9BB85A1D2F0D682D:8A3126F71F03319]:0)
[junit4] > at
org.apache.solr.cloud.autoscaling.ScheduledTriggerIntegrationTest.testScheduledTrigger(ScheduledTriggerIntegrationTest.java:120)
[junit4] > at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit4] > at
java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
[junit4] > at
java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
[junit4] > at
java.base/java.lang.reflect.Method.invoke(Method.java:564)
[junit4] > at java.base/java.lang.Thread.run(Thread.java:832)
[junit4] 2> NOTE: leaving temporary files on disk at:
C:\Users\jenkins\workspace\Lucene-Solr-8.x-Windows\solr\build\solr-core\test\J2\temp\solr.cloud.autoscaling.ScheduledTriggerIntegrationTest_9BB85A1D2F0D682D-001
[junit4] 2> NOTE: test params are: codec=Asserting(Lucene84): {},
docValues:{}, maxPointsInLeafNode=196, maxMBSortInHeap=7.770077616239789,
sim=Asserting(org.apache.lucene.search.similarities.AssertingSimilarity@2a68ac5),
locale=kea-CV, timezone=SystemV/AST4
[junit4] 2> NOTE: Windows 10 10.0 amd64/Oracle Corporation 15-ea
(64-bit)/cpus=6,threads=1,free=392167424,total=536870912
[junit4] 2> NOTE: All tests run in this JVM: [TestBinaryField,
DOMUtilTest, TestLuceneMatchVersion, AssignTest,
TestMultiValuedNumericRangeQuery, SolrPluginUtilsTest, DocValuesMultiTest,
LoggingHandlerTest, IgnoreCommitOptimizeUpdateProcessorFactoryTest,
SolrLogAuditLoggerPluginTest, SuggesterFSTTest, SplitHandlerTest,
TestSchemaVersionResource, StressHdfsTest, TriggerEventQueueTest,
CategoryRoutedAliasUpdateProcessorTest, NodeMarkersRegistrationTest,
TestEmbeddedSolrServerAdminHandler, TestTrie, TestStressInPlaceUpdates,
TestInPlaceUpdateWithRouteField, TestDynamicLoading, CopyFieldTest,
SolrCoreCheckLockOnStartupTest, TestPullReplicaErrorHandling, VersionInfoTest,
MaxSizeAutoCommitTest, TestDocumentBuilder, SystemCollectionCompatTest,
MoveReplicaHDFSFailoverTest, AutoscalingHistoryHandlerTest, ClusterStateTest,
TestFieldTypeCollectionResource, OverseerTaskQueueTest, IndexSchemaTest,
BinaryUpdateRequestHandlerTest, TestTermsQParserPlugin,
NestedShardedAtomicUpdateTest, SolrCLIZkUtilsTest, TestCollationFieldDocValues,
TestSQLHandlerNonCloud, AnalysisErrorHandlingTest, CloudReplicaSourceTest,
HdfsDirectoryTest, DistributedFacetSimpleRefinementLongTailTest,
TestNoOpRegenerator, TestRemoteStreaming, CdcrBootstrapTest, ShardSplitTest,
SpellCheckCollatorWithCollapseTest, SolrCloudReportersTest,
HdfsChaosMonkeySafeLeaderTest, SimpleFacetsTest, TestExportWriter,
TestLockTree, PropertiesRequestHandlerTest, TestInitParams, TaggerTest,
TestSolrJ, TestJsonRangeFacets, BigEndianAscendingWordSerializerTest,
TestSimDistribStateManager, BasicDistributedZkTest, RecoveryZkTest,
CoreMergeIndexesAdminHandlerTest, TestIBSimilarityFactory, TestRTimerTree,
DistributedQueryElevationComponentTest, UniqFieldsUpdateProcessorFactoryTest,
DefaultValueUpdateProcessorTest, TestHighFrequencyDictionaryFactory,
TestXIncludeConfig, TestTestInjection, DirectSolrConnectionTest, TestCSVLoader,
BlobRepositoryCloudTest, InfixSuggestersTest, TestSortableTextField,
TestReloadDeadlock, TestLegacyNumericRangeQueryBuilder, PolyFieldTest,
TestNestedUpdateProcessor, HighlighterMaxOffsetTest, QueryResultKeyTest,
TestSolrConfigHandler, DistributedFacetPivotSmallTest, TestReRankQParserPlugin,
TestUnifiedSolrHighlighterWithoutStoredId, TestCryptoKeys, NumberUtilsTest,
ClusterStateUpdateTest, CollectionStateFormat2Test, ConnectionManagerTest,
CreateRoutedAliasTest, DeleteShardTest, DistribCursorPagingTest,
DistributedVersionInfoTest, HttpPartitionOnCommitTest,
OverseerCollectionConfigSetProcessorTest, OverseerRolesTest,
RemoteQueryErrorTest, ReplaceNodeNoTargetTest, ReplaceNodeTest,
TestCloudConsistency, TestRandomRequestDistribution, TestRequestForwarding,
TestSegmentSorting, TestStressLiveNodes, CollectionsAPIDistributedZkTest,
IndexSizeTriggerTest, MetricTriggerTest, NodeAddedTriggerIntegrationTest,
ScheduledTriggerIntegrationTest]
[junit4] Completed [621/908 (1!)] on J2 in 50.15s, 1 test, 1 failure <<<
FAILURES!
[...truncated 45753 lines...]
[repro] Jenkins log URL:
https://jenkins.thetaphi.de/job/Lucene-Solr-8.x-Windows/1150/consoleText
[repro] Revision: 9d6c738ffce0c3164691f161ba8b92a615b1e062
[repro] Ant options: "-Dargs=-XX:-UseCompressedOops
-XX:+UnlockExperimentalVMOptions -XX:+UseZGC"
[repro] JUnit rest result XML files will be moved to: ./repro-reports
[repro] ant clean
[...truncated 6 lines...]
[repro] Test suites by module:
[repro] solr\core
[repro] ScheduledTriggerIntegrationTest
[repro] ant compile-test
[...truncated 3484 lines...]
[repro] ant test-nocompile -Dtests.dups=5 -Dtests.maxfailures=5
-Dtests.class="*.ScheduledTriggerIntegrationTest" -Dtests.showOutput=onerror
"-Dargs=-XX:-UseCompressedOops -XX:+UnlockExperimentalVMOptions -XX:+UseZGC"
-Dtests.seed=9BB85A1D2F0D682D -Dtests.slow=true -Dtests.locale=kea-CV
-Dtests.timezone=SystemV/AST4 -Dtests.asserts=true -Dtests.file.encoding=Cp1252
[...truncated 82 lines...]
[repro] Failures w/original seeds:
[repro] 0/5 failed:
org.apache.solr.cloud.autoscaling.ScheduledTriggerIntegrationTest
[repro] Exiting with code 0
[...truncated 78 lines...]
---------------------------------------------------------------------
To unsubscribe, e-mail: builds-unsubscr...@lucene.apache.org
For additional commands, e-mail: builds-h...@lucene.apache.org
