You are viewing a plain text version of this content. The canonical link for it is here.
Posted to builds@lucene.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2020/05/26 05:46:22 UTC

[JENKINS] Lucene-Solr-NightlyTests-8.x - Build # 454 - Unstable

Build: https://builds.apache.org/job/Lucene-Solr-NightlyTests-8.x/454/

3 tests failed.
FAILED:  org.apache.solr.cloud.RollingRestartTest.test

Error Message:
Timeout occurred while waiting response from server at: https://127.0.0.1:34480/tx_rb

Stack Trace:
org.apache.solr.client.solrj.SolrServerException: Timeout occurred while waiting response from server at: https://127.0.0.1:34480/tx_rb
	at __randomizedtesting.SeedInfo.seed([AAE4FAD43611100E:22B0C50E98ED7DF6]:0)
	at org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:674)
	at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:265)
	at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:248)
	at org.apache.solr.client.solrj.impl.LBSolrClient.doRequest(LBSolrClient.java:368)
	at org.apache.solr.client.solrj.impl.LBSolrClient.request(LBSolrClient.java:296)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.sendRequest(BaseCloudSolrClient.java:1147)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.requestWithRetryOnStaleState(BaseCloudSolrClient.java:910)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.request(BaseCloudSolrClient.java:842)
	at org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:211)
	at org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:228)
	at org.apache.solr.cloud.RollingRestartTest.restartWithRolesTest(RollingRestartTest.java:74)
	at org.apache.solr.cloud.RollingRestartTest.test(RollingRestartTest.java:53)
	at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
	at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
	at java.lang.reflect.Method.invoke(Method.java:498)
	at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java: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 org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1081)
	at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1053)
	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 com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
	at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
	at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
	at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
	at java.lang.Thread.run(Thread.java:748)
Caused by: java.net.SocketTimeoutException: Read timed out
	at java.net.SocketInputStream.socketRead0(Native Method)
	at java.net.SocketInputStream.socketRead(SocketInputStream.java:116)
	at java.net.SocketInputStream.read(SocketInputStream.java:171)
	at java.net.SocketInputStream.read(SocketInputStream.java:141)
	at sun.security.ssl.InputRecord.readFully(InputRecord.java:465)
	at sun.security.ssl.InputRecord.read(InputRecord.java:503)
	at sun.security.ssl.SSLSocketImpl.readRecord(SSLSocketImpl.java:975)
	at sun.security.ssl.SSLSocketImpl.readDataRecord(SSLSocketImpl.java:933)
	at sun.security.ssl.AppInputStream.read(AppInputStream.java:105)
	at org.apache.http.impl.io.SessionInputBufferImpl.streamRead(SessionInputBufferImpl.java:137)
	at org.apache.http.impl.io.SessionInputBufferImpl.fillBuffer(SessionInputBufferImpl.java:153)
	at org.apache.http.impl.io.SessionInputBufferImpl.readLine(SessionInputBufferImpl.java:280)
	at org.apache.http.impl.conn.DefaultHttpResponseParser.parseHead(DefaultHttpResponseParser.java:138)
	at org.apache.http.impl.conn.DefaultHttpResponseParser.parseHead(DefaultHttpResponseParser.java:56)
	at org.apache.http.impl.io.AbstractMessageParser.parse(AbstractMessageParser.java:259)
	at org.apache.http.impl.DefaultBHttpClientConnection.receiveResponseHeader(DefaultBHttpClientConnection.java:163)
	at org.apache.http.impl.conn.CPoolProxy.receiveResponseHeader(CPoolProxy.java:157)
	at org.apache.http.protocol.HttpRequestExecutor.doReceiveResponse(HttpRequestExecutor.java:273)
	at org.apache.http.protocol.HttpRequestExecutor.execute(HttpRequestExecutor.java:125)
	at org.apache.http.impl.execchain.MainClientExec.execute(MainClientExec.java:272)
	at org.apache.http.impl.execchain.ProtocolExec.execute(ProtocolExec.java:186)
	at org.apache.http.impl.execchain.RetryExec.execute(RetryExec.java:89)
	at org.apache.http.impl.execchain.RedirectExec.execute(RedirectExec.java:110)
	at org.apache.http.impl.client.InternalHttpClient.doExecute(InternalHttpClient.java:185)
	at org.apache.http.impl.client.CloseableHttpClient.execute(CloseableHttpClient.java:83)
	at org.apache.http.impl.client.CloseableHttpClient.execute(CloseableHttpClient.java:56)
	at org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:564)
	... 52 more


FAILED:  org.apache.solr.cloud.autoscaling.AutoScalingHandlerTest.testReadApi

Error Message:
expected:<2> but was:<3>

Stack Trace:
java.lang.AssertionError: expected:<2> but was:<3>
	at __randomizedtesting.SeedInfo.seed([AAE4FAD43611100E:FDCD0161EDE3F215]:0)
	at org.junit.Assert.fail(Assert.java:88)
	at org.junit.Assert.failNotEquals(Assert.java:834)
	at org.junit.Assert.assertEquals(Assert.java:645)
	at org.junit.Assert.assertEquals(Assert.java:631)
	at org.apache.solr.cloud.autoscaling.AutoScalingHandlerTest.testReadApi(AutoScalingHandlerTest.java:902)
	at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
	at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
	at java.lang.reflect.Method.invoke(Method.java:498)
	at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java: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 com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
	at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
	at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
	at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
	at java.lang.Thread.run(Thread.java:748)


FAILED:  org.apache.solr.cloud.autoscaling.AutoScalingHandlerTest.testSuggestionsWithPayload

Error Message:


Stack Trace:
java.lang.AssertionError
	at __randomizedtesting.SeedInfo.seed([AAE4FAD43611100E:F328F7D96A59B951]:0)
	at org.junit.Assert.fail(Assert.java:86)
	at org.junit.Assert.assertTrue(Assert.java:41)
	at org.junit.Assert.assertTrue(Assert.java:52)
	at org.apache.solr.cloud.autoscaling.AutoScalingHandlerTest.testSuggestionsWithPayload(AutoScalingHandlerTest.java:129)
	at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
	at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
	at java.lang.reflect.Method.invoke(Method.java:498)
	at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java: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 com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
	at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
	at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
	at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
	at java.lang.Thread.run(Thread.java:748)




Build Log:
[...truncated 14629 lines...]
   [junit4] Suite: org.apache.solr.cloud.autoscaling.AutoScalingHandlerTest
   [junit4]   2> 2656397 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.SolrTestCase Setting 'solr.default.confdir' system property to test-framework derived value of '/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/server/solr/configsets/_default/conf'
   [junit4]   2> 2656397 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
   [junit4]   2> 2656397 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.SolrTestCaseJ4 Created dataDir: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/data-dir-113-001
   [junit4]   2> 2656397 WARN  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=10 numCloses=10
   [junit4]   2> 2656397 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true) w/NUMERIC_DOCVALUES_SYSPROP=true
   [junit4]   2> 2656411 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.SolrTestCaseJ4 Randomized ssl (true) and clientAuth (true) via: @org.apache.solr.util.RandomizeSSL(reason=, ssl=NaN, value=NaN, clientAuth=NaN)
   [junit4]   2> 2656412 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.MiniSolrCloudCluster Starting cluster of 2 servers in /home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001
   [junit4]   2> 2656413 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
   [junit4]   2> 2656413 INFO  (ZkTestServer Run Thread) [     ] o.a.s.c.ZkTestServer client port: 0.0.0.0/0.0.0.0:0
   [junit4]   2> 2656413 INFO  (ZkTestServer Run Thread) [     ] o.a.s.c.ZkTestServer Starting server
   [junit4]   2> 2656513 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.ZkTestServer start zk server on port: 41281
   [junit4]   2> 2656513 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.ZkTestServer waitForServerUp: 127.0.0.1:41281
   [junit4]   2> 2656513 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:41281
   [junit4]   2> 2656513 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.ZkTestServer connecting to 127.0.0.1 41281
   [junit4]   2> 2656515 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2656521 INFO  (zkConnectionManagerCallback-15502-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2656532 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2656537 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2656538 INFO  (zkConnectionManagerCallback-15504-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2656538 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2656539 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2656540 INFO  (zkConnectionManagerCallback-15506-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2656540 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2656647 WARN  (jetty-launcher-15507-thread-1) [     ] o.e.j.s.h.g.GzipHandler minGzipSize of 0 is inefficient for short content, break even is size 23
   [junit4]   2> 2656647 WARN  (jetty-launcher-15507-thread-2) [     ] o.e.j.s.h.g.GzipHandler minGzipSize of 0 is inefficient for short content, break even is size 23
   [junit4]   2> 2656647 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
   [junit4]   2> 2656647 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
   [junit4]   2> 2656647 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
   [junit4]   2> 2656647 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
   [junit4]   2> 2656648 INFO  (jetty-launcher-15507-thread-1) [     ] o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git: a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 1.8.0_191-b12
   [junit4]   2> 2656648 INFO  (jetty-launcher-15507-thread-2) [     ] o.e.j.s.Server jetty-9.4.27.v20200227; built: 2020-02-27T18:37:21.340Z; git: a304fd9f351f337e7c0e2a7c28878dd536149c6c; jvm 1.8.0_191-b12
   [junit4]   2> 2656649 INFO  (jetty-launcher-15507-thread-2) [     ] o.e.j.s.session DefaultSessionIdManager workerName=node0
   [junit4]   2> 2656649 INFO  (jetty-launcher-15507-thread-2) [     ] o.e.j.s.session No SessionScavenger set, using defaults
   [junit4]   2> 2656649 INFO  (jetty-launcher-15507-thread-2) [     ] o.e.j.s.session node0 Scavenging every 600000ms
   [junit4]   2> 2656649 INFO  (jetty-launcher-15507-thread-1) [     ] o.e.j.s.session DefaultSessionIdManager workerName=node0
   [junit4]   2> 2656649 INFO  (jetty-launcher-15507-thread-1) [     ] o.e.j.s.session No SessionScavenger set, using defaults
   [junit4]   2> 2656649 INFO  (jetty-launcher-15507-thread-1) [     ] o.e.j.s.session node0 Scavenging every 600000ms
   [junit4]   2> 2656649 INFO  (jetty-launcher-15507-thread-2) [     ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@2fac1355{/solr,null,AVAILABLE}
   [junit4]   2> 2656649 INFO  (jetty-launcher-15507-thread-1) [     ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@78b101c0{/solr,null,AVAILABLE}
   [junit4]   2> 2656650 INFO  (jetty-launcher-15507-thread-2) [     ] o.e.j.s.AbstractConnector Started ServerConnector@77e92e76{SSL, (ssl, http/1.1)}{127.0.0.1:43301}
   [junit4]   2> 2656650 INFO  (jetty-launcher-15507-thread-1) [     ] o.e.j.s.AbstractConnector Started ServerConnector@c941df3{SSL, (ssl, http/1.1)}{127.0.0.1:41888}
   [junit4]   2> 2656650 INFO  (jetty-launcher-15507-thread-1) [     ] o.e.j.s.Server Started @2656686ms
   [junit4]   2> 2656650 INFO  (jetty-launcher-15507-thread-2) [     ] o.e.j.s.Server Started @2656686ms
   [junit4]   2> 2656650 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, hostPort=41888}
   [junit4]   2> 2656650 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, hostPort=43301}
   [junit4]   2> 2656651 ERROR (jetty-launcher-15507-thread-2) [     ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
   [junit4]   2> 2656651 ERROR (jetty-launcher-15507-thread-1) [     ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 8.6.0
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 8.6.0
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 2020-05-26T03:36:34.281Z
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr
   [junit4]   2> 2656651 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 2020-05-26T03:36:34.281Z
   [junit4]   2> 2656652 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2656652 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2656653 INFO  (zkConnectionManagerCallback-15509-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2656653 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2656653 INFO  (zkConnectionManagerCallback-15511-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2656653 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2656654 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 2656654 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 2657840 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
   [junit4]   2> 2657841 WARN  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
   [junit4]   2> 2657842 WARN  (jetty-launcher-15507-thread-1) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@59f0bbc6[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 2657842 WARN  (jetty-launcher-15507-thread-1) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@59f0bbc6[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 2657857 WARN  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
   [junit4]   2> 2657858 WARN  (jetty-launcher-15507-thread-1) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@49d3e84e[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 2657858 WARN  (jetty-launcher-15507-thread-1) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@49d3e84e[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 2657859 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:41281/solr
   [junit4]   2> 2657860 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2657861 INFO  (zkConnectionManagerCallback-15525-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2657861 INFO  (jetty-launcher-15507-thread-1) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2657986 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2658014 INFO  (zkConnectionManagerCallback-15527-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2658014 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2658204 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:41888_solr
   [junit4]   2> 2658205 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.c.Overseer Overseer (id=72859736958894086-127.0.0.1:41888_solr-n_0000000000) starting
   [junit4]   2> 2658211 INFO  (OverseerStateUpdate-72859736958894086-127.0.0.1:41888_solr-n_0000000000) [n:127.0.0.1:41888_solr     ] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:41888_solr
   [junit4]   2> 2658211 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:41888_solr
   [junit4]   2> 2658212 INFO  (OverseerStateUpdate-72859736958894086-127.0.0.1:41888_solr-n_0000000000) [n:127.0.0.1:41888_solr     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
   [junit4]   2> 2658215 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.p.PackageLoader /packages.json updated to version -1
   [junit4]   2> 2658215 WARN  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_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> 2658304 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
   [junit4]   2> 2658488 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_41888.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2658542 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_41888.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2658542 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_41888.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2658544 INFO  (jetty-launcher-15507-thread-1) [n:127.0.0.1:41888_solr     ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node1/.
   [junit4]   2> 2659608 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
   [junit4]   2> 2659609 WARN  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
   [junit4]   2> 2659609 WARN  (jetty-launcher-15507-thread-2) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@7d18d4c9[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 2659609 WARN  (jetty-launcher-15507-thread-2) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@7d18d4c9[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 2659612 WARN  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.s.i.Http2SolrClient Create Http2SolrClient with HTTP/1.1 transport since Java 8 or lower versions does not support SSL + HTTP/2
   [junit4]   2> 2659621 WARN  (jetty-launcher-15507-thread-2) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@42926919[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 2659621 WARN  (jetty-launcher-15507-thread-2) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@42926919[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 2659623 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:41281/solr
   [junit4]   2> 2659623 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2659625 INFO  (zkConnectionManagerCallback-15547-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2659625 INFO  (jetty-launcher-15507-thread-2) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2659727 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2659728 INFO  (zkConnectionManagerCallback-15549-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2659728 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2659734 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
   [junit4]   2> 2659738 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.c.ZkController Publish node=127.0.0.1:43301_solr as DOWN
   [junit4]   2> 2659739 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores
   [junit4]   2> 2659739 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:43301_solr
   [junit4]   2> 2659740 INFO  (zkCallback-15526-thread-1) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
   [junit4]   2> 2659741 INFO  (zkCallback-15548-thread-1) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
   [junit4]   2> 2659742 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.p.PackageLoader /packages.json updated to version -1
   [junit4]   2> 2659742 WARN  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_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> 2659782 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
   [junit4]   2> 2659847 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_43301.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2659903 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_43301.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2659904 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_43301.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2659918 INFO  (jetty-launcher-15507-thread-2) [n:127.0.0.1:43301_solr     ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node2/.
   [junit4]   2> 2659952 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.MiniSolrCloudCluster waitForAllNodes: numServers=2
   [junit4]   2> 2659952 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 2659953 INFO  (zkConnectionManagerCallback-15562-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 2659953 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 2659955 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2)
   [junit4]   2> 2659956 INFO  (SUITE-AutoScalingHandlerTest-seed#[AAE4FAD43611100E]-worker) [     ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:41281/solr ready
   [junit4]   2> 2660188 INFO  (TEST-AutoScalingHandlerTest.testReadApi-seed#[AAE4FAD43611100E]) [     ] o.a.s.SolrTestCaseJ4 ###Starting testReadApi
   [junit4]   2> 2660330 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr     ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores
   [junit4]   2> 2660330 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_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> 2660428 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_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=0
   [junit4]   2> 2660429 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling params={wt=javabin&version=2} status=0 QTime=105
   [junit4]   2> 2660459 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_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=0
   [junit4]   2> 2660464 INFO  (qtp940825919-77590) [n:127.0.0.1:43301_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=0
   [junit4]   2> 2660464 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling params={wt=javabin&version=2} status=0 QTime=31
   [junit4]   2> 2660484 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=2
   [junit4]   2> 2660513 INFO  (qtp940825919-77590) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660514 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/autoscaling params={wt=javabin&version=2} status=0 QTime=49
   [junit4]   2> 2660518 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660519 INFO  (qtp940825919-77590) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660520 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/autoscaling params={wt=javabin&version=2} status=0 QTime=5
   [junit4]   2> 2660522 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling params={wt=javabin&version=2} status=0 QTime=0
   [junit4]   2> 2660525 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660535 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660536 INFO  (qtp940825919-77590) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling/diagnostics params={wt=javabin&version=2} status=0 QTime=12
   [junit4]   2> 2660540 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660541 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660542 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/cluster/autoscaling params={wt=javabin&version=2} status=0 QTime=3
   [junit4]   2> 2660543 INFO  (qtp940825919-77590) [n:127.0.0.1:43301_solr     ] o.a.s.h.a.CollectionsHandler Invoked Collection Action :create with params collection.configName=conf&maxShardsPerNode=3&name=readApiTestViolations&nrtReplicas=6&action=CREATE&numShards=1&wt=javabin&version=2 and sendToOCPQueue=true
   [junit4]   2> 2660545 INFO  (OverseerThreadFactory-15534-thread-1-processing-n:127.0.0.1:41888_solr) [n:127.0.0.1:41888_solr     ] o.a.s.c.a.c.CreateCollectionCmd Create collection readApiTestViolations
   [junit4]   2> 2660658 WARN  (OverseerThreadFactory-15534-thread-1-processing-n:127.0.0.1:41888_solr) [n:127.0.0.1:41888_solr     ] o.a.s.c.a.c.CreateCollectionCmd Specified number of replicas of 6 on collection readApiTestViolations 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> 2660665 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660670 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660671 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660673 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/metrics params={prefix=CONTAINER.fs.usableSpace,CONTAINER.fs.totalSpace,CONTAINER.cores,os.systemLoadAverage,memory.heap.usage&wt=javabin&version=2&group=solr.jvm,solr.node} status=0 QTime=0
   [junit4]   2> 2660706 INFO  (OverseerStateUpdate-72859736958894086-127.0.0.1:41888_solr-n_0000000000) [n:127.0.0.1:41888_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "collection":"readApiTestViolations",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "core":"readApiTestViolations_shard1_replica_n1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "base_url":"https://127.0.0.1:43301/solr",
   [junit4]   2>   "node_name":"127.0.0.1:43301_solr",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 2660721 INFO  (OverseerStateUpdate-72859736958894086-127.0.0.1:41888_solr-n_0000000000) [n:127.0.0.1:41888_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "collection":"readApiTestViolations",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "core":"readApiTestViolations_shard1_replica_n2",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "base_url":"https://127.0.0.1:41888/solr",
   [junit4]   2>   "node_name":"127.0.0.1:41888_solr",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 2660724 INFO  (OverseerStateUpdate-72859736958894086-127.0.0.1:41888_solr-n_0000000000) [n:127.0.0.1:41888_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "collection":"readApiTestViolations",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "core":"readApiTestViolations_shard1_replica_n4",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "base_url":"https://127.0.0.1:43301/solr",
   [junit4]   2>   "node_name":"127.0.0.1:43301_solr",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 2660726 INFO  (OverseerStateUpdate-72859736958894086-127.0.0.1:41888_solr-n_0000000000) [n:127.0.0.1:41888_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "collection":"readApiTestViolations",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "core":"readApiTestViolations_shard1_replica_n6",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "base_url":"https://127.0.0.1:41888/solr",
   [junit4]   2>   "node_name":"127.0.0.1:41888_solr",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 2660728 INFO  (OverseerStateUpdate-72859736958894086-127.0.0.1:41888_solr-n_0000000000) [n:127.0.0.1:41888_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "collection":"readApiTestViolations",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "core":"readApiTestViolations_shard1_replica_n8",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "base_url":"https://127.0.0.1:43301/solr",
   [junit4]   2>   "node_name":"127.0.0.1:43301_solr",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 2660731 INFO  (OverseerStateUpdate-72859736958894086-127.0.0.1:41888_solr-n_0000000000) [n:127.0.0.1:41888_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "collection":"readApiTestViolations",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "core":"readApiTestViolations_shard1_replica_n10",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "base_url":"https://127.0.0.1:41888/solr",
   [junit4]   2>   "node_name":"127.0.0.1:41888_solr",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 2660934 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr    x:readApiTestViolations_shard1_replica_n2 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node5&collection.configName=conf&newCollection=true&name=readApiTestViolations_shard1_replica_n2&action=CREATE&numShards=1&collection=readApiTestViolations&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 2660935 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr    x:readApiTestViolations_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node3&collection.configName=conf&newCollection=true&name=readApiTestViolations_shard1_replica_n1&action=CREATE&numShards=1&collection=readApiTestViolations&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 2660937 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr    x:readApiTestViolations_shard1_replica_n6 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node9&collection.configName=conf&newCollection=true&name=readApiTestViolations_shard1_replica_n6&action=CREATE&numShards=1&collection=readApiTestViolations&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 2660937 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr    x:readApiTestViolations_shard1_replica_n10 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node12&collection.configName=conf&newCollection=true&name=readApiTestViolations_shard1_replica_n10&action=CREATE&numShards=1&collection=readApiTestViolations&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 2660938 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr    x:readApiTestViolations_shard1_replica_n8 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node11&collection.configName=conf&newCollection=true&name=readApiTestViolations_shard1_replica_n8&action=CREATE&numShards=1&collection=readApiTestViolations&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 2660939 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr    x:readApiTestViolations_shard1_replica_n4 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node7&collection.configName=conf&newCollection=true&name=readApiTestViolations_shard1_replica_n4&action=CREATE&numShards=1&collection=readApiTestViolations&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 2661005 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.6.0
   [junit4]   2> 2661005 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.6.0
   [junit4]   2> 2661006 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.6.0
   [junit4]   2> 2661007 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.6.0
   [junit4]   2> 2661109 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.6.0
   [junit4]   2> 2661111 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 2661114 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 2661114 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.c.CoreContainer Creating SolrCore 'readApiTestViolations_shard1_replica_n2' using configuration from configset conf, trusted=true
   [junit4]   2> 2661114 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_41888.solr.core.readApiTestViolations.shard1.replica_n2' (registry 'solr.core.readApiTestViolations.shard1.replica_n2') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2661127 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.c.SolrCore [[readApiTestViolations_shard1_replica_n2] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node1/./readApiTestViolations_shard1_replica_n2], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node1/./readApiTestViolations_shard1_replica_n2/data/]
   [junit4]   2> 2661136 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.6.0
   [junit4]   2> 2661137 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 2661141 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 2661153 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 2661155 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 2661155 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.c.CoreContainer Creating SolrCore 'readApiTestViolations_shard1_replica_n6' using configuration from configset conf, trusted=true
   [junit4]   2> 2661160 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 2661160 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.CoreContainer Creating SolrCore 'readApiTestViolations_shard1_replica_n4' using configuration from configset conf, trusted=true
   [junit4]   2> 2661161 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_43301.solr.core.readApiTestViolations.shard1.replica_n4' (registry 'solr.core.readApiTestViolations.shard1.replica_n4') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2661161 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.SolrCore [[readApiTestViolations_shard1_replica_n4] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node2/./readApiTestViolations_shard1_replica_n4], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node2/./readApiTestViolations_shard1_replica_n4/data/]
   [junit4]   2> 2661161 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 2661163 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 2661163 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.c.CoreContainer Creating SolrCore 'readApiTestViolations_shard1_replica_n8' using configuration from configset conf, trusted=true
   [junit4]   2> 2661164 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 2661164 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.c.CoreContainer Creating SolrCore 'readApiTestViolations_shard1_replica_n10' using configuration from configset conf, trusted=true
   [junit4]   2> 2661164 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_43301.solr.core.readApiTestViolations.shard1.replica_n8' (registry 'solr.core.readApiTestViolations.shard1.replica_n8') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2661164 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.c.SolrCore [[readApiTestViolations_shard1_replica_n8] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node2/./readApiTestViolations_shard1_replica_n8], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node2/./readApiTestViolations_shard1_replica_n8/data/]
   [junit4]   2> 2661164 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_41888.solr.core.readApiTestViolations.shard1.replica_n10' (registry 'solr.core.readApiTestViolations.shard1.replica_n10') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2661164 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.c.SolrCore [[readApiTestViolations_shard1_replica_n10] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node1/./readApiTestViolations_shard1_replica_n10], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node1/./readApiTestViolations_shard1_replica_n10/data/]
   [junit4]   2> 2661176 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_41888.solr.core.readApiTestViolations.shard1.replica_n6' (registry 'solr.core.readApiTestViolations.shard1.replica_n6') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2661176 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.c.SolrCore [[readApiTestViolations_shard1_replica_n6] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node1/./readApiTestViolations_shard1_replica_n6], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node1/./readApiTestViolations_shard1_replica_n6/data/]
   [junit4]   2> 2661245 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 2661247 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 2661247 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.c.CoreContainer Creating SolrCore 'readApiTestViolations_shard1_replica_n1' using configuration from configset conf, trusted=true
   [junit4]   2> 2661248 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_43301.solr.core.readApiTestViolations.shard1.replica_n1' (registry 'solr.core.readApiTestViolations.shard1.replica_n1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@4830305f
   [junit4]   2> 2661248 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.c.SolrCore [[readApiTestViolations_shard1_replica_n1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node2/./readApiTestViolations_shard1_replica_n1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J1/temp/solr.cloud.autoscaling.AutoScalingHandlerTest_AAE4FAD43611100E-001/tempDir-001/node2/./readApiTestViolations_shard1_replica_n1/data/]
   [junit4]   2> 2661696 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 2661696 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 2661698 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 2661698 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 2661699 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 2661699 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 2661776 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf
   [junit4]   2> 2661777 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 2661777 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 2661777 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf
   [junit4]   2> 2661778 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 2661778 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1667722588358443008
   [junit4]   2> 2661780 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 2661780 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 2661780 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf
   [junit4]   2> 2661780 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 2661780 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 2661782 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 2661782 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 2661798 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf
   [junit4]   2> 2661799 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 2661799 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1667722588380463104
   [junit4]   2> 2661802 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 2661802 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 2661806 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 2661806 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 2661807 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 2661807 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 2661819 INFO  (searcherExecutor-15568-thread-1-processing-n:127.0.0.1:43301_solr x:readApiTestViolations_shard1_replica_n4 c:readApiTestViolations s:shard1 r:core_node7) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.SolrCore [readApiTestViolations_shard1_replica_n4]  Registered new searcher autowarm time: 0 ms: Collection: 'readApiTestViolations'
   [junit4]   2> 2661819 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf
   [junit4]   2> 2661820 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf
   [junit4]   2> 2661820 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 2661820 INFO  (searcherExecutor-15564-thread-1-processing-n:127.0.0.1:41888_solr x:readApiTestViolations_shard1_replica_n2 c:readApiTestViolations s:shard1 r:core_node5) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.c.SolrCore [readApiTestViolations_shard1_replica_n2]  Registered new searcher autowarm time: 0 ms: Collection: 'readApiTestViolations'
   [junit4]   2> 2661820 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1667722588402483200
   [junit4]   2> 2661821 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf
   [junit4]   2> 2661821 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf
   [junit4]   2> 2661823 INFO  (searcherExecutor-15574-thread-1-processing-n:127.0.0.1:43301_solr x:readApiTestViolations_shard1_replica_n1 c:readApiTestViolations s:shard1 r:core_node3) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.c.SolrCore [readApiTestViolations_shard1_replica_n1]  Registered new searcher autowarm time: 0 ms: Collection: 'readApiTestViolations'
   [junit4]   2> 2661824 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/readApiTestViolations/terms/shard1 to Terms{values={core_node7=0}, version=0}
   [junit4]   2> 2661825 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.c.ZkShardTerms Failed to save terms, version is not a match, retrying
   [junit4]   2> 2661825 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/readApiTestViolations/terms/shard1 to Terms{values={core_node7=0, core_node3=0}, version=1}
   [junit4]   2> 2661825 INFO  (qtp940825919-77588) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/readApiTestViolations/leaders/shard1
   [junit4]   2> 2661825 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/readApiTestViolations/leaders/shard1
   [junit4]   2> 2661825 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/readApiTestViolations/terms/shard1 to Terms{values={core_node7=0, core_node3=0, core_node5=0}, version=2}
   [junit4]   2> 2661826 INFO  (qtp1131344341-77587) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/readApiTestViolations/leaders/shard1
   [junit4]   2> 2661833 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 2661833 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 2661834 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 2661834 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1667722588417163264
   [junit4]   2> 2661855 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 2661855 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 2661855 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf
   [junit4]   2> 2661855 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf
   [junit4]   2> 2661856 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 2661856 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1667722588440231936
   [junit4]   2> 2661856 INFO  (searcherExecutor-15572-thread-1-processing-n:127.0.0.1:41888_solr x:readApiTestViolations_shard1_replica_n10 c:readApiTestViolations s:shard1 r:core_node12) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.c.SolrCore [readApiTestViolations_shard1_replica_n10]  Registered new searcher autowarm time: 0 ms: Collection: 'readApiTestViolations'
   [junit4]   2> 2661857 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/readApiTestViolations/terms/shard1 to Terms{values={core_node7=0, core_node12=0, core_node3=0, core_node5=0}, version=3}
   [junit4]   2> 2661857 INFO  (qtp1131344341-77589) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/readApiTestViolations/leaders/shard1
   [junit4]   2> 2661866 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf
   [junit4]   2> 2661875 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf
   [junit4]   2> 2661875 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 2661875 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1667722588460154880
   [junit4]   2> 2661876 INFO  (searcherExecutor-15566-thread-1-processing-n:127.0.0.1:41888_solr x:readApiTestViolations_shard1_replica_n6 c:readApiTestViolations s:shard1 r:core_node9) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.c.SolrCore [readApiTestViolations_shard1_replica_n6]  Registered new searcher autowarm time: 0 ms: Collection: 'readApiTestViolations'
   [junit4]   2> 2661876 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContext Waiting until we see more replicas up for shard shard1: total=6 found=4 timeoute in=9999ms
   [junit4]   2> 2661876 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/readApiTestViolations/terms/shard1 to Terms{values={core_node7=0, core_node12=0, core_node9=0, core_node3=0, core_node5=0}, version=4}
   [junit4]   2> 2661876 INFO  (qtp1131344341-77591) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/readApiTestViolations/leaders/shard1
   [junit4]   2> 2661891 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/readApiTestViolations/terms/shard1 to Terms{values={core_node7=0, core_node12=0, core_node9=0, core_node11=0, core_node3=0, core_node5=0}, version=5}
   [junit4]   2> 2661891 INFO  (qtp940825919-77656) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/readApiTestViolations/leaders/shard1
   [junit4]   2> 2661899 INFO  (searcherExecutor-15570-thread-1-processing-n:127.0.0.1:43301_solr x:readApiTestViolations_shard1_replica_n8 c:readApiTestViolations s:shard1 r:core_node11) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.c.SolrCore [readApiTestViolations_shard1_replica_n8]  Registered new searcher autowarm time: 0 ms: Collection: 'readApiTestViolations'
   [junit4]   2> 2662378 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 2662378 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 2662378 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.SyncStrategy Sync replicas to https://127.0.0.1:43301/solr/readApiTestViolations_shard1_replica_n4/
   [junit4]   2> 2662379 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.u.PeerSync PeerSync: core=readApiTestViolations_shard1_replica_n4 url=https://127.0.0.1:43301/solr  START replicas=[https://127.0.0.1:43301/solr/readApiTestViolations_shard1_replica_n1/, https://127.0.0.1:41888/solr/readApiTestViolations_shard1_replica_n2/, https://127.0.0.1:41888/solr/readApiTestViolations_shard1_replica_n6/, https://127.0.0.1:43301/solr/readApiTestViolations_shard1_replica_n8/, https://127.0.0.1:41888/solr/readApiTestViolations_shard1_replica_n10/] nUpdates=100
   [junit4]   2> 2662381 INFO  (qtp940825919-77676) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node3 x:readApiTestViolations_shard1_replica_n1 ] o.a.s.c.S.Request [readApiTestViolations_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> 2662382 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.u.PeerSync PeerSync: core=readApiTestViolations_shard1_replica_n4 url=https://127.0.0.1:43301/solr  DONE. We have no versions. sync failed.
   [junit4]   2> 2662382 INFO  (qtp1131344341-77678) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node5 x:readApiTestViolations_shard1_replica_n2 ] o.a.s.c.S.Request [readApiTestViolations_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> 2662382 INFO  (qtp940825919-77676) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node11 x:readApiTestViolations_shard1_replica_n8 ] o.a.s.c.S.Request [readApiTestViolations_shard1_replica_n8]  webapp=/solr path=/get params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2} status=0 QTime=0
   [junit4]   2> 2662384 INFO  (qtp1131344341-77678) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node12 x:readApiTestViolations_shard1_replica_n10 ] o.a.s.c.S.Request [readApiTestViolations_shard1_replica_n10]  webapp=/solr path=/get params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2} status=0 QTime=0
   [junit4]   2> 2662384 INFO  (qtp1131344341-77680) [n:127.0.0.1:41888_solr c:readApiTestViolations s:shard1 r:core_node9 x:readApiTestViolations_shard1_replica_n6 ] o.a.s.c.S.Request [readApiTestViolations_shard1_replica_n6]  webapp=/solr path=/get params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2} status=0 QTime=0
   [junit4]   2> 2662385 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.SyncStrategy Leader's attempt to sync with shard failed, moving to the next candidate
   [junit4]   2> 2662385 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_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> 2662385 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node /collections/readApiTestViolations/leaders/shard1/leader after winning as /collections/readApiTestViolations/leader_elect/shard1/election/72859736958894088-core_node7-n_0000000000
   [junit4]   2> 2662394 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.ShardLeaderElectionContext I am the new leader: https://127.0.0.1:43301/solr/readApiTestViolations_shard1_replica_n4/ shard1
   [junit4]   2> 2662496 INFO  (zkCallback-15548-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/readApiTestViolations/state.json] for collection [readApiTestViolations] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 2662497 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr c:readApiTestViolations s:shard1 r:core_node7 x:readApiTestViolations_shard1_replica_n4 ] o.a.s.c.ZkController I am the leader, no recovery necessary
   [junit4]   2> 2662510 INFO  (qtp940825919-77586) [n:127.0.0.1:43301_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node7&collection.configName=conf&newCollection=true&name=readApiTestViolations_shard1_replica_n4&action=CREATE&numShards=1&collection=readApiTestViolations&shard=shard1&wt=javabin&version=2&replicaType=NRT} status=0 QTime=1571
   [junit4]   2> 2662600 INFO  (zkCallback-15

[...truncated too long message...]

s=true -Dtests.file.encoding=ISO-8859-1
   [junit4] ERROR    188s J2 | RollingRestartTest.test <<<
   [junit4]    > Throwable #1: org.apache.solr.client.solrj.SolrServerException: Timeout occurred while waiting response from server at: https://127.0.0.1:34480/tx_rb
   [junit4]    > 	at __randomizedtesting.SeedInfo.seed([AAE4FAD43611100E:22B0C50E98ED7DF6]:0)
   [junit4]    > 	at org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:674)
   [junit4]    > 	at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:265)
   [junit4]    > 	at org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:248)
   [junit4]    > 	at org.apache.solr.client.solrj.impl.LBSolrClient.doRequest(LBSolrClient.java:368)
   [junit4]    > 	at org.apache.solr.client.solrj.impl.LBSolrClient.request(LBSolrClient.java:296)
   [junit4]    > 	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.sendRequest(BaseCloudSolrClient.java:1147)
   [junit4]    > 	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.requestWithRetryOnStaleState(BaseCloudSolrClient.java:910)
   [junit4]    > 	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.request(BaseCloudSolrClient.java:842)
   [junit4]    > 	at org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:211)
   [junit4]    > 	at org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:228)
   [junit4]    > 	at org.apache.solr.cloud.RollingRestartTest.restartWithRolesTest(RollingRestartTest.java:74)
   [junit4]    > 	at org.apache.solr.cloud.RollingRestartTest.test(RollingRestartTest.java:53)
   [junit4]    > 	at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsFixedStatement.callStatement(BaseDistributedSearchTestCase.java:1081)
   [junit4]    > 	at org.apache.solr.BaseDistributedSearchTestCase$ShardsRepeatRule$ShardsStatement.evaluate(BaseDistributedSearchTestCase.java:1053)
   [junit4]    > 	at java.lang.Thread.run(Thread.java:748)
   [junit4]    > Caused by: java.net.SocketTimeoutException: Read timed out
   [junit4]    > 	at java.net.SocketInputStream.socketRead0(Native Method)
   [junit4]    > 	at java.net.SocketInputStream.socketRead(SocketInputStream.java:116)
   [junit4]    > 	at java.net.SocketInputStream.read(SocketInputStream.java:171)
   [junit4]    > 	at java.net.SocketInputStream.read(SocketInputStream.java:141)
   [junit4]    > 	at sun.security.ssl.InputRecord.readFully(InputRecord.java:465)
   [junit4]    > 	at sun.security.ssl.InputRecord.read(InputRecord.java:503)
   [junit4]    > 	at sun.security.ssl.SSLSocketImpl.readRecord(SSLSocketImpl.java:975)
   [junit4]    > 	at sun.security.ssl.SSLSocketImpl.readDataRecord(SSLSocketImpl.java:933)
   [junit4]    > 	at sun.security.ssl.AppInputStream.read(AppInputStream.java:105)
   [junit4]    > 	at org.apache.http.impl.io.SessionInputBufferImpl.streamRead(SessionInputBufferImpl.java:137)
   [junit4]    > 	at org.apache.http.impl.io.SessionInputBufferImpl.fillBuffer(SessionInputBufferImpl.java:153)
   [junit4]    > 	at org.apache.http.impl.io.SessionInputBufferImpl.readLine(SessionInputBufferImpl.java:280)
   [junit4]    > 	at org.apache.http.impl.conn.DefaultHttpResponseParser.parseHead(DefaultHttpResponseParser.java:138)
   [junit4]    > 	at org.apache.http.impl.conn.DefaultHttpResponseParser.parseHead(DefaultHttpResponseParser.java:56)
   [junit4]    > 	at org.apache.http.impl.io.AbstractMessageParser.parse(AbstractMessageParser.java:259)
   [junit4]    > 	at org.apache.http.impl.DefaultBHttpClientConnection.receiveResponseHeader(DefaultBHttpClientConnection.java:163)
   [junit4]    > 	at org.apache.http.impl.conn.CPoolProxy.receiveResponseHeader(CPoolProxy.java:157)
   [junit4]    > 	at org.apache.http.protocol.HttpRequestExecutor.doReceiveResponse(HttpRequestExecutor.java:273)
   [junit4]    > 	at org.apache.http.protocol.HttpRequestExecutor.execute(HttpRequestExecutor.java:125)
   [junit4]    > 	at org.apache.http.impl.execchain.MainClientExec.execute(MainClientExec.java:272)
   [junit4]    > 	at org.apache.http.impl.execchain.ProtocolExec.execute(ProtocolExec.java:186)
   [junit4]    > 	at org.apache.http.impl.execchain.RetryExec.execute(RetryExec.java:89)
   [junit4]    > 	at org.apache.http.impl.execchain.RedirectExec.execute(RedirectExec.java:110)
   [junit4]    > 	at org.apache.http.impl.client.InternalHttpClient.doExecute(InternalHttpClient.java:185)
   [junit4]    > 	at org.apache.http.impl.client.CloseableHttpClient.execute(CloseableHttpClient.java:83)
   [junit4]    > 	at org.apache.http.impl.client.CloseableHttpClient.execute(CloseableHttpClient.java:56)
   [junit4]    > 	at org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:564)
   [junit4]    > 	... 52 more
   [junit4]   2> NOTE: leaving temporary files on disk at: /home/jenkins/jenkins-slave/workspace/Lucene-Solr-NightlyTests-8.x/checkout/solr/build/solr-core/test/J2/temp/solr.cloud.RollingRestartTest_AAE4FAD43611100E-001
   [junit4]   2> May 26, 2020 4:12:26 AM com.carrotsearch.randomizedtesting.ThreadLeakControl checkThreadLeaks
   [junit4]   2> WARNING: Will linger awaiting termination of 1 leaked thread(s).
   [junit4]   2> NOTE: test params are: codec=Asserting(Lucene86): {}, docValues:{}, maxPointsInLeafNode=1268, maxMBSortInHeap=7.938910511472194, sim=Asserting(org.apache.lucene.search.similarities.AssertingSimilarity@1c1ad21d), locale=bg-BG, timezone=Asia/Sakhalin
   [junit4]   2> NOTE: Linux 4.4.0-170-generic amd64/Oracle Corporation 1.8.0_191 (64-bit)/cpus=8,threads=1,free=202270416,total=533200896
   [junit4]   2> NOTE: All tests run in this JVM: [TestNestedUpdateProcessor, TestExtendedDismaxParser, RequestLoggingTest, ChaosMonkeyNothingIsSafeWithPullReplicasTest, ShardRoutingCustomTest, TestPolicyCloud, DistributedFacetPivotSmallTest, HdfsRestartWhileUpdatingTest, ZookeeperStatusHandlerTest, TestPHPSerializedResponseWriter, DynamicMapsTest, SystemInfoHandlerTest, TriggerIntegrationTest, BasicAuthStandaloneTest, SpellCheckComponentTest, CollectionPropsTest, HighlighterWithoutStoredIdTest, TermsComponentTest, NodeLostTriggerTest, TestExternalRoleRuleBasedAuthorizationPlugin, TestSolrJacksonAnnotation, TestMultiValuedNumericRangeQuery, RemoteQueryErrorTest, TestHighFrequencyDictionaryFactory, BlockJoinFacetSimpleTest, TestInitQParser, OverseerSolrResponseUnsafeSerializationTest, TestEmbeddedSolrServerConstructors, DeleteShardTest, SolrCloudReportersTest, AutoAddReplicasIntegrationTest, TestUnInvertedFieldException, TestMissingGroups, TestGraphTermsQParserPlugin, NotRequiredUniqueKeyTest, HdfsNNFailoverTest, TestUnifiedSolrHighlighterWithoutStoredId, SuggesterTSTTest, CustomHighlightComponentTest, TestLegacyNumericRangeQueryBuilder, AtomicUpdatesTest, TestSimLargeCluster, TestFieldTypeCollectionResource, TestAnalyzeInfixSuggestions, TestTlogReplica, TestCryptoKeys, TestSolrConfigHandlerConcurrent, AddSchemaFieldsUpdateProcessorFactoryTest, TestSimExecutePlanAction, TestSimUtils, TestSQLHandler, TestFileDictionaryLookup, TestCoreDiscovery, TestIBSimilarityFactory, PolyFieldTest, TestFieldCache, ConvertedLegacyTest, DistributedQueryComponentCustomSortTest, TestSolrDeletionPolicy2, ForceLeaderWithTlogReplicasTest, TestDistributedGrouping, TestInPlaceUpdatesRequiredField, TestStandardQParsers, TestCollectionAPI, TestGeoJSONResponseWriter, DistributedVersionInfoTest, SchemaVersionSpecificBehaviorTest, DocValuesTest, TestConfigsApi, CoreSorterTest, RandomizedTaggerTest, TestUninvertingReader, TestSurroundQueryParser, OutOfBoxZkACLAndCredentialsProvidersTest, TestDefaultStatsCache, TestCloudPivotFacet, MetricsHandlerTest, TestExclusionRuleCollectionAccess, RankQueryTest, TestDocumentBuilder, TestSSLRandomization, TestDocBasedVersionConstraints, TestBulkSchemaAPI, TestRecoveryHdfs, TestSimpleTrackingShardHandler, TestManagedResource, TestSolrJ, CoreAdminCreateDiscoverTest, TestLuceneMatchVersion, TestOnReconnectListenerSupport, TestIntervalFaceting, TestStressInPlaceUpdates, ResponseLogComponentTest, ByteBuffersDirectoryFactoryTest, OverseerTest, TestReplicationHandlerDiskOverFlow, SubstringBytesRefFilterTest, SliceStateTest, DistributedDebugComponentTest, TestComplexPhraseLeadingWildcard, DistributedFacetPivotLargeTest, ComputePlanActionTest, DistribDocExpirationUpdateProcessorTest, HdfsTlogReplayBufferedWhileIndexingTest, SolrXmlInZkTest, TestQuerySenderNoQuery, TokenizerChainTest, DocumentBuilderTest, TestDynamicFieldResource, OutputWriterTest, IndexSchemaRuntimeFieldTest, CopyFieldTest, TestDistributedTracing, TestMacros, TestSearchPerf, TestPseudoReturnFields, TestSimPolicyCloud, TestOverriddenPrefixQueryForCustomFieldType, TestAddFieldRealTimeGet, RuleEngineTest, ZkControllerTest, ZkStateReaderTest, TestPullReplicaErrorHandling, ProtectedTermFilterFactoryTest, TestConfig, XsltUpdateRequestHandlerTest, HttpTriggerListenerTest, RecoveryAfterSoftCommitTest, TestCloudDeleteByQuery, TestLegacyBM25SimilarityFactory, HdfsDirectoryFactoryTest, AlternateDirectoryTest, LeaderFailureAfterFreshStartTest, PrimitiveFieldTypeTest, SolrTestCaseJ4Test, TestSchemaResource, MergeStrategyTest, SynonymTokenizerTest, AuditLoggerPluginTest, FileBasedSpellCheckerTest, BJQParserTest, TestCSVLoader, ParsingFieldUpdateProcessorsTest, TestSolrCoreSnapshots, HttpSolrCallGetCoreTest, CreateCollectionCleanupTest, ChaosMonkeySafeLeaderTest, ConcurrentCreateRoutedAliasTest, ConfigSetsAPITest, DeleteInactiveReplicaTest, DeleteLastCustomShardedReplicaTest, DeleteNodeTest, DistribJoinFromCollectionTest, FullSolrCloudDistribCmdsTest, LeaderElectionContextKeyTest, LeaderElectionIntegrationTest, LeaderElectionTest, LeaderTragicEventTest, LeaderVoteWaitTimeoutTest, MissingSegmentRecoveryTest, MoveReplicaHDFSTest, MoveReplicaTest, MultiSolrCloudTestCaseTest, MultiThreadedOCPTest, ReplaceNodeNoTargetTest, ReplaceNodeTest, RollingRestartTest]
   [junit4] Completed [514/910 (2!)] on J2 in 188.61s, 1 test, 1 error <<< FAILURES!

[...truncated 53631 lines...]