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 2021/09/20 10:12:13 UTC

[JENKINS] Lucene » Lucene-Solr-BadApples-Tests-8.x - Build # 406 - Still Unstable!

Build: https://ci-builds.apache.org/job/Lucene/job/Lucene-Solr-BadApples-Tests-8.x/406/

2 tests failed.
FAILED:  org.apache.solr.handler.admin.AutoscalingHistoryHandlerTest.testHistory

Error Message:
action did not execute

Stack Trace:
java.lang.AssertionError: action did not execute
	at __randomizedtesting.SeedInfo.seed([FE32852D365A4D1B:93CE21D08C12B21C]:0)
	at org.junit.Assert.fail(Assert.java:89)
	at org.junit.Assert.assertTrue(Assert.java:42)
	at org.apache.solr.handler.admin.AutoscalingHistoryHandlerTest.testHistory(AutoscalingHistoryHandlerTest.java:285)
	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.junit.rules.RunRules.evaluate(RunRules.java:20)
	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 org.junit.rules.RunRules.evaluate(RunRules.java:20)
	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.junit.rules.RunRules.evaluate(RunRules.java:20)
	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 org.junit.rules.RunRules.evaluate(RunRules.java:20)
	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.search.TestFiltering.testRandomFiltering

Error Message:
should have unwrapped

Stack Trace:
java.lang.AssertionError: should have unwrapped
	at __randomizedtesting.SeedInfo.seed([FE32852D365A4D1B:E15126E8D37D0D12]:0)
	at org.apache.solr.search.SolrIndexSearcher.getAndCacheDocSet(SolrIndexSearcher.java:862)
	at org.apache.solr.search.SolrIndexSearcher.getDocSet(SolrIndexSearcher.java:824)
	at org.apache.solr.search.SolrIndexSearcher.getDocListC(SolrIndexSearcher.java:1367)
	at org.apache.solr.search.SolrIndexSearcher.search(SolrIndexSearcher.java:596)
	at org.apache.solr.handler.component.QueryComponent.doProcessUngroupedSearch(QueryComponent.java:1511)
	at org.apache.solr.handler.component.QueryComponent.process(QueryComponent.java:390)
	at org.apache.solr.handler.component.SearchHandler.handleRequestBody(SearchHandler.java:368)
	at org.apache.solr.handler.RequestHandlerBase.handleRequest(RequestHandlerBase.java:216)
	at org.apache.solr.core.SolrCore.execute(SolrCore.java:2637)
	at org.apache.solr.util.TestHarness.query(TestHarness.java:346)
	at org.apache.solr.util.TestHarness.query(TestHarness.java:328)
	at org.apache.solr.SolrTestCaseJ4.assertJQ(SolrTestCaseJ4.java:1090)
	at org.apache.solr.SolrTestCaseJ4.assertJQ(SolrTestCaseJ4.java:1059)
	at org.apache.solr.search.TestFiltering.testRandomFiltering(TestFiltering.java:488)
	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.junit.rules.RunRules.evaluate(RunRules.java:20)
	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 org.junit.rules.RunRules.evaluate(RunRules.java:20)
	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.junit.rules.RunRules.evaluate(RunRules.java:20)
	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 org.junit.rules.RunRules.evaluate(RunRules.java:20)
	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 14172 lines...]
   [junit4] Suite: org.apache.solr.handler.admin.AutoscalingHistoryHandlerTest
   [junit4]   2> 408395 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.SolrTestCase Setting 'solr.default.confdir' system property to test-framework derived value of '/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/server/solr/configsets/_default/conf'
   [junit4]   2> 408396 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.SolrTestCaseJ4 Created dataDir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J2/temp/solr.handler.admin.AutoscalingHistoryHandlerTest_FE32852D365A4D1B-001/data-dir-63-001
   [junit4]   2> 408396 WARN  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=1 numCloses=1
   [junit4]   2> 408396 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true) w/NUMERIC_DOCVALUES_SYSPROP=false
   [junit4]   2> 408400 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-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> 408400 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
   [junit4]   2> 408400 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.SolrCloudTestCase Using per-replica state
   [junit4]   2> 408401 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.MiniSolrCloudCluster Starting cluster of 2 servers in /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J2/temp/solr.handler.admin.AutoscalingHistoryHandlerTest_FE32852D365A4D1B-001/tempDir-001
   [junit4]   2> 408401 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
   [junit4]   2> 408405 INFO  (ZkTestServer Run Thread) [     ] o.a.s.c.ZkTestServer client port: 0.0.0.0/0.0.0.0:0
   [junit4]   2> 408405 INFO  (ZkTestServer Run Thread) [     ] o.a.s.c.ZkTestServer Starting server
   [junit4]   2> 408406 WARN  (ZkTestServer Run Thread) [     ] o.a.z.s.ServerCnxnFactory maxCnxns is not configured, using default value 0.
   [junit4]   2> 408505 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.ZkTestServer start zk server on port: 44723
   [junit4]   2> 408505 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.ZkTestServer waitForServerUp: 127.0.0.1:44723
   [junit4]   2> 408505 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:44723
   [junit4]   2> 408505 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.ZkTestServer connecting to 127.0.0.1 44723
   [junit4]   2> 408516 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 408525 INFO  (zkConnectionManagerCallback-4276-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 408525 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 408556 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 408581 INFO  (zkConnectionManagerCallback-4278-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 408581 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 408597 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 408615 INFO  (zkConnectionManagerCallback-4280-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 408615 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 408720 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
   [junit4]   2> 408720 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
   [junit4]   2> 408720 INFO  (jetty-launcher-4281-thread-2) [     ] o.e.j.s.Server jetty-9.4.41.v20210516; built: 2021-05-16T23:56:28.993Z; git: 98607f93c7833e7dc59489b13f3cb0a114fb9f4c; jvm 1.8.0_291-b10
   [junit4]   2> 408722 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
   [junit4]   2> 408722 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
   [junit4]   2> 408722 INFO  (jetty-launcher-4281-thread-1) [     ] o.e.j.s.Server jetty-9.4.41.v20210516; built: 2021-05-16T23:56:28.993Z; git: 98607f93c7833e7dc59489b13f3cb0a114fb9f4c; jvm 1.8.0_291-b10
   [junit4]   2> 408737 INFO  (jetty-launcher-4281-thread-2) [     ] o.e.j.s.session DefaultSessionIdManager workerName=node0
   [junit4]   2> 408737 INFO  (jetty-launcher-4281-thread-2) [     ] o.e.j.s.session No SessionScavenger set, using defaults
   [junit4]   2> 408737 INFO  (jetty-launcher-4281-thread-2) [     ] o.e.j.s.session node0 Scavenging every 660000ms
   [junit4]   2> 408737 INFO  (jetty-launcher-4281-thread-1) [     ] o.e.j.s.session DefaultSessionIdManager workerName=node0
   [junit4]   2> 408737 INFO  (jetty-launcher-4281-thread-1) [     ] o.e.j.s.session No SessionScavenger set, using defaults
   [junit4]   2> 408737 INFO  (jetty-launcher-4281-thread-1) [     ] o.e.j.s.session node0 Scavenging every 660000ms
   [junit4]   2> 408738 INFO  (jetty-launcher-4281-thread-2) [     ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@5346e2e2{/solr,null,AVAILABLE}
   [junit4]   2> 408738 INFO  (jetty-launcher-4281-thread-1) [     ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@5e27613d{/solr,null,AVAILABLE}
   [junit4]   2> 408738 INFO  (jetty-launcher-4281-thread-2) [     ] o.e.j.s.AbstractConnector Started ServerConnector@387b4800{SSL, (ssl, http/1.1)}{127.0.0.1:33117}
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-2) [     ] o.e.j.s.Server Started @408769ms
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-1) [     ] o.e.j.s.AbstractConnector Started ServerConnector@7d26152b{SSL, (ssl, http/1.1)}{127.0.0.1:36561}
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, zkHost=127.0.0.1:44723/solr, hostPort=33117}
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-1) [     ] o.e.j.s.Server Started @408769ms
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, zkHost=127.0.0.1:44723/solr, hostPort=36561}
   [junit4]   2> 408739 ERROR (jetty-launcher-4281-thread-2) [     ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> 408739 ERROR (jetty-launcher-4281-thread-1) [     ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 8.11.0
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr? version 8.11.0
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 2021-09-20T09:15:35.828Z
   [junit4]   2> 408739 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 2021-09-20T09:15:35.828Z
   [junit4]   2> 408740 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 408741 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 408742 INFO  (zkConnectionManagerCallback-4285-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 408742 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 408742 INFO  (zkConnectionManagerCallback-4284-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 408742 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 408742 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 408745 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 408747 WARN  (jetty-launcher-4281-thread-1-SendThread(127.0.0.1:44723)) [     ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x107b96a65fd0003.
   [junit4]   2>           => EndOfStreamException: Unable to read additional data from server sessionid 0x107b96a65fd0003, likely server has closed socket
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
   [junit4]   2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x107b96a65fd0003, likely server has closed socket
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
   [junit4]   2> 408849 WARN  (jetty-launcher-4281-thread-2-SendThread(127.0.0.1:44723)) [     ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x107b96a65fd0004.
   [junit4]   2>           => EndOfStreamException: Unable to read additional data from server sessionid 0x107b96a65fd0004, likely server has closed socket
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
   [junit4]   2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x107b96a65fd0004, likely server has closed socket
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
   [junit4]   2> 410407 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
   [junit4]   2> 410407 WARN  (jetty-launcher-4281-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> 410408 WARN  (jetty-launcher-4281-thread-1) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@6910aad7[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 410408 WARN  (jetty-launcher-4281-thread-1) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@6910aad7[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 410411 WARN  (jetty-launcher-4281-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> 410413 WARN  (jetty-launcher-4281-thread-1) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@46261795[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 410413 WARN  (jetty-launcher-4281-thread-1) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@46261795[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 410414 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:44723/solr
   [junit4]   2> 410415 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 410417 INFO  (zkConnectionManagerCallback-4299-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 410417 INFO  (jetty-launcher-4281-thread-1) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 410523 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 410523 INFO  (zkConnectionManagerCallback-4301-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 410523 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 410599 WARN  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.c.ZkController Contents of zookeeper /security.json are world-readable; consider setting up ACLs as described in https://solr.apache.org/guide/zookeeper-access-control.html
   [junit4]   2> 410603 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:36561_solr
   [junit4]   2> 410604 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer Overseer (id=74231785503653894-127.0.0.1:36561_solr-n_0000000000) starting
   [junit4]   2> 410609 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:36561_solr
   [junit4]   2> 410610 INFO  (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:36561_solr
   [junit4]   2> 410611 DEBUG (OverseerAutoScalingTriggerThread-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [     ] o.a.s.c.a.OverseerTriggerThread Adding .auto_add_replicas and .scheduled_maintenance triggers
   [junit4]   2> 410612 DEBUG (OverseerAutoScalingTriggerThread-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [     ] o.a.s.c.a.OverseerTriggerThread Refreshing /autoscaling.json with znode version 1
   [junit4]   2> 410614 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.p.PackageLoader /packages.json updated to version -1
   [junit4]   2> 410614 DEBUG (OverseerAutoScalingTriggerThread-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [     ] o.a.s.c.a.OverseerTriggerThread Current znodeVersion 1, lastZnodeVersion 0
   [junit4]   2> 410614 DEBUG (OverseerAutoScalingTriggerThread-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [     ] o.a.s.c.a.OverseerTriggerThread Processed trigger updates upto znodeVersion 1
   [junit4]   2> 410614 WARN  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_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> 410621 INFO  (zkCallback-4300-thread-1) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
   [junit4]   2> 410625 DEBUG (OverseerAutoScalingTriggerThread-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [     ] o.a.s.c.a.NodeLostTrigger NodeLostTrigger .auto_add_replicas - Initial livenodes: [127.0.0.1:36561_solr]
   [junit4]   2> 410628 DEBUG (ScheduledTrigger-4306-thread-1) [     ] o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with currently live nodes: 1 and last live nodes: 1
   [junit4]   2> 410628 DEBUG (OverseerAutoScalingTriggerThread-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [     ] o.a.s.c.a.OverseerTriggerThread -- deactivating old nodeLost / nodeAdded markers
   [junit4]   2> 410629 DEBUG (OverseerAutoScalingTriggerThread-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [     ] o.a.s.c.a.OverseerTriggerThread Current znodeVersion 1, lastZnodeVersion 1
   [junit4]   2> 410640 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
   [junit4]   2> 410691 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_36561.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@22f7c40b
   [junit4]   2> 410698 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_36561.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@22f7c40b
   [junit4]   2> 410698 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_36561.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@22f7c40b
   [junit4]   2> 410699 INFO  (jetty-launcher-4281-thread-1) [n:127.0.0.1:36561_solr     ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J2/temp/solr.handler.admin.AutoscalingHistoryHandlerTest_FE32852D365A4D1B-001/tempDir-001/node2
   [junit4]   2> 411183 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
   [junit4]   2> 411184 WARN  (jetty-launcher-4281-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> 411185 WARN  (jetty-launcher-4281-thread-2) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@7f8df9ad[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 411185 WARN  (jetty-launcher-4281-thread-2) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@7f8df9ad[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 411188 WARN  (jetty-launcher-4281-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> 411189 WARN  (jetty-launcher-4281-thread-2) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@497d5d16[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 411189 WARN  (jetty-launcher-4281-thread-2) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@497d5d16[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 411190 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:44723/solr
   [junit4]   2> 411193 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 411194 INFO  (zkConnectionManagerCallback-4321-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 411194 INFO  (jetty-launcher-4281-thread-2) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 411296 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 411298 INFO  (zkConnectionManagerCallback-4323-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 411298 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 411302 WARN  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.c.ZkController Contents of zookeeper /security.json are world-readable; consider setting up ACLs as described in https://solr.apache.org/guide/zookeeper-access-control.html
   [junit4]   2> 411303 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
   [junit4]   2> 411309 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.c.ZkController Publish node=127.0.0.1:33117_solr as DOWN
   [junit4]   2> 411310 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient core cache for max 2147483647 cores with initial capacity of 1024
   [junit4]   2> 411310 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:33117_solr
   [junit4]   2> 411311 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 1, message = {
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "operation":"downnode"} current state version: 0
   [junit4]   2> 411311 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.NodeMutator DownNode state invoked for node: 127.0.0.1:33117_solr
   [junit4]   2> 411311 INFO  (zkCallback-4300-thread-1) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
   [junit4]   2> 411312 INFO  (zkCallback-4322-thread-1) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
   [junit4]   2> 411313 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.p.PackageLoader /packages.json updated to version -1
   [junit4]   2> 411313 WARN  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_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> 411338 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
   [junit4]   2> 411360 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_33117.solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@22f7c40b
   [junit4]   2> 411370 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_33117.solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@22f7c40b
   [junit4]   2> 411370 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_33117.solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@22f7c40b
   [junit4]   2> 411371 INFO  (jetty-launcher-4281-thread-2) [n:127.0.0.1:33117_solr     ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J2/temp/solr.handler.admin.AutoscalingHistoryHandlerTest_FE32852D365A4D1B-001/tempDir-001/node1
   [junit4]   2> 411390 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.MiniSolrCloudCluster waitForAllNodes: numServers=2
   [junit4]   2> 411391 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 411392 INFO  (zkConnectionManagerCallback-4336-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 411392 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 411393 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2)
   [junit4]   2> 411394 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:44723/solr ready
   [junit4]   2> 411449 INFO  (OverseerThreadFactory-4308-thread-1-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.a.c.CreateCollectionCmd Create collection .system
   [junit4]   2> 411453 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 1, message = {
   [junit4]   2>   "name":".system",
   [junit4]   2>   "fromApi":"true",
   [junit4]   2>   "numShards":1,
   [junit4]   2>   "createNodeSet":"127.0.0.1:36561_solr",
   [junit4]   2>   "nrtReplicas":"1",
   [junit4]   2>   "stateFormat":"2",
   [junit4]   2>   "replicationFactor":"1",
   [junit4]   2>   "operation":"create"} current state version: 0
   [junit4]   2> 411453 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ClusterStateMutator building a new cName: .system
   [junit4]   2> 411453 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ZkStateWriter going to create_collection /collections/.system/state.json
   [junit4]   2> 411557 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 1, message = {
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>   "collection":".system",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} current state version: 0
   [junit4]   2> 411558 INFO  (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>   "collection":".system",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 411559 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator Old Slice: shard1:{
   [junit4]   2>   "range":"80000000-7fffffff",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "replicas":{}}
   [junit4]   2> 411559 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator New Slice: shard1:{
   [junit4]   2>   "range":"80000000-7fffffff",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "replicas":{"core_node2":{
   [junit4]   2>       "core":".system_shard1_replica_n1",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:36561/solr"}}}
   [junit4]   2> 411630 DEBUG (ScheduledTrigger-4306-thread-2) [     ] o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with currently live nodes: 2 and last live nodes: 1
   [junit4]   2> 411660 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ZkStateWriter going to update_collection /collections/.system/state.json version: 0
   [junit4]   2> 411768 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr    x:.system_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node2&collection.configName=.system&newCollection=true&name=.system_shard1_replica_n1&action=CREATE&numShards=1&collection=.system&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 411768 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr    x:.system_shard1_replica_n1 ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient core cache for max 2147483647 cores with initial capacity of 1024
   [junit4]   2> 411773 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 1, message = {
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "core_node_name":"core_node2",
   [junit4]   2>   "roles":null,
   [junit4]   2>   "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>   "numShards":"1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "collection":".system",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false",
   [junit4]   2>   "operation":"state"} current state version: 0
   [junit4]   2> 411773 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Update state numShards=1 message={
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "core_node_name":"core_node2",
   [junit4]   2>   "roles":null,
   [junit4]   2>   "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>   "numShards":"1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "collection":".system",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false",
   [junit4]   2>   "operation":"state"}
   [junit4]   2> 411773 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Will update state for replica: core_node2:{
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false"}
   [junit4]   2> 411773 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Collection is now: DocCollection(.system//collections/.system/state.json/1 )={
   [junit4]   2>   "pullReplicas":"0",
   [junit4]   2>   "replicationFactor":"1",
   [junit4]   2>   "router":{"name":"compositeId"},
   [junit4]   2>   "maxShardsPerNode":"1",
   [junit4]   2>   "autoAddReplicas":"false",
   [junit4]   2>   "nrtReplicas":"1",
   [junit4]   2>   "tlogReplicas":"0",
   [junit4]   2>   "shards":{"shard1":{
   [junit4]   2>       "range":"80000000-7fffffff",
   [junit4]   2>       "state":"active",
   [junit4]   2>       "replicas":{"core_node2":{
   [junit4]   2>           "core":".system_shard1_replica_n1",
   [junit4]   2>           "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>           "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>           "state":"down",
   [junit4]   2>           "type":"NRT",
   [junit4]   2>           "force_set_state":"false"}}}}}
   [junit4]   2> 411780 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.11.0
   [junit4]   2> 411781 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ManagedIndexSchemaFactory The schema is configured as managed, but managed schema resource managed-schema not found - loading non-managed schema schema.xml instead
   [junit4]   2> 411782 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.IndexSchema Schema name=_system collection or core
   [junit4]   2> 411783 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.IndexSchema Loaded schema _system collection or core/1.1 with uniqueid field id
   [junit4]   2> 411784 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ManagedIndexSchema Created and persisted managed schema znode at /configs/.system/managed-schema
   [junit4]   2> 411786 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ManagedIndexSchemaFactory After upgrading to managed schema in ZooKeeper, renamed the non-managed schema /configs/.system/schema.xml to /configs/.system/schema.xml.bak
   [junit4]   2> 411787 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.CoreContainer Creating SolrCore '.system_shard1_replica_n1' using configuration from configset .system, trusted=true
   [junit4]   2> 411787 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr_36561.solr.core..system.shard1.replica_n1' (registry 'solr.core..system.shard1.replica_n1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@22f7c40b
   [junit4]   2> 411787 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SolrCore [[.system_shard1_replica_n1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J2/temp/solr.handler.admin.AutoscalingHistoryHandlerTest_FE32852D365A4D1B-001/tempDir-001/node2/.system_shard1_replica_n1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J2/temp/solr.handler.admin.AutoscalingHistoryHandlerTest_FE32852D365A4D1B-001/tempDir-001/node2/.system_shard1_replica_n1/data/]
   [junit4]   2> 411837 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 411838 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 411839 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.CommitTracker Hard AutoCommit: if 1 uncommitted docs; 
   [junit4]   2> 411839 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 411841 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/.system
   [junit4]   2> 411841 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/.system
   [junit4]   2> 411842 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Creating ZooKeeper watch for the managed schema at /configs/.system/managed-schema
   [junit4]   2> 411842 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Current schema version 0 is already the latest
   [junit4]   2> 411843 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 411843 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1711411653699960832
   [junit4]   2> 411846 INFO  (searcherExecutor-4338-thread-1-processing-n:127.0.0.1:36561_solr x:.system_shard1_replica_n1 c:.system s:shard1 r:core_node2) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SolrCore [.system_shard1_replica_n1]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 411854 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/.system/terms/shard1 to Terms{values={core_node2=0}, version=0}
   [junit4]   2> 411854 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/.system/leaders/shard1
   [junit4]   2> 411858 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 411858 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 411858 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync replicas to https://127.0.0.1:36561/solr/.system_shard1_replica_n1/
   [junit4]   2> 411859 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
   [junit4]   2> 411859 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SyncStrategy https://127.0.0.1:36561/solr/.system_shard1_replica_n1/ has no replicas
   [junit4]   2> 411859 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node /collections/.system/leaders/shard1/leader after winning as /collections/.system/leader_elect/shard1/election/74231785503653894-core_node2-n_0000000000
   [junit4]   2> 411862 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I am the new leader: https://127.0.0.1:36561/solr/.system_shard1_replica_n1/ shard1
   [junit4]   2> 411862 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 2, message = {
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "collection":".system",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "operation":"leader"} current state version: 0
   [junit4]   2> 411963 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ZkStateWriter going to update_collection /collections/.system/state.json version: 1
   [junit4]   2> 411964 INFO  (zkCallback-4300-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/.system/state.json] for collection [.system] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 411965 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ZkController I am the leader, no recovery necessary
   [junit4]   2> 411967 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 1, message = {
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "core_node_name":"core_node2",
   [junit4]   2>   "roles":null,
   [junit4]   2>   "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>   "numShards":"1",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "collection":".system",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false",
   [junit4]   2>   "operation":"state"} current state version: 0
   [junit4]   2> 411967 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Update state numShards=1 message={
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "core_node_name":"core_node2",
   [junit4]   2>   "roles":null,
   [junit4]   2>   "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>   "numShards":"1",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "collection":".system",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false",
   [junit4]   2>   "operation":"state"}
   [junit4]   2> 411967 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Will update state for replica: core_node2:{
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false",
   [junit4]   2>   "leader":"true"}
   [junit4]   2> 411967 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Collection is now: DocCollection(.system//collections/.system/state.json/2 )={
   [junit4]   2>   "pullReplicas":"0",
   [junit4]   2>   "replicationFactor":"1",
   [junit4]   2>   "router":{"name":"compositeId"},
   [junit4]   2>   "maxShardsPerNode":"1",
   [junit4]   2>   "autoAddReplicas":"false",
   [junit4]   2>   "nrtReplicas":"1",
   [junit4]   2>   "tlogReplicas":"0",
   [junit4]   2>   "shards":{"shard1":{
   [junit4]   2>       "range":"80000000-7fffffff",
   [junit4]   2>       "state":"active",
   [junit4]   2>       "replicas":{"core_node2":{
   [junit4]   2>           "core":".system_shard1_replica_n1",
   [junit4]   2>           "node_name":"127.0.0.1:36561_solr",
   [junit4]   2>           "base_url":"https://127.0.0.1:36561/solr",
   [junit4]   2>           "state":"active",
   [junit4]   2>           "type":"NRT",
   [junit4]   2>           "force_set_state":"false",
   [junit4]   2>           "leader":"true"}}}}}
   [junit4]   2> 411969 INFO  (qtp853342011-6536) [n:127.0.0.1:36561_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node2&collection.configName=.system&newCollection=true&name=.system_shard1_replica_n1&action=CREATE&numShards=1&collection=.system&shard=shard1&wt=javabin&version=2&replicaType=NRT} status=0 QTime=201
   [junit4]   2> 411972 INFO  (qtp853342011-6531) [n:127.0.0.1:36561_solr     ] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 45 seconds. Check all shard replicas
   [junit4]   2> 412068 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ZkStateWriter going to update_collection /collections/.system/state.json version: 2
   [junit4]   2> 412068 INFO  (zkCallback-4300-thread-4) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/.system/state.json] for collection [.system] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 412068 INFO  (zkCallback-4300-thread-2) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/.system/state.json] for collection [.system] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 412069 INFO  (qtp853342011-6531) [n:127.0.0.1:36561_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections params={name=.system&nrtReplicas=1&action=CREATE&numShards=1&createNodeSet=127.0.0.1:36561_solr&wt=javabin&version=2} status=0 QTime=628
   [junit4]   2> 412069 INFO  (SUITE-AutoscalingHistoryHandlerTest-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.MiniSolrCloudCluster waitForActiveCollection: .system
   [junit4]   2> 412076 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.a.c.CreateCollectionCmd Create collection AutoscalingHistoryHandlerTest_collection
   [junit4]   2> 412077 INFO  (OverseerCollectionConfigSetProcessor-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.OverseerTaskQueue Response ZK path: /overseer/collection-queue-work/qnr-0000000000 doesn't exist. Requestor may have disconnected from ZooKeeper
   [junit4]   2> 412077 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED
   [junit4]   2> 412078 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/protwords.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/protwords.txt
   [junit4]   2> 412079 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/managed-schema to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/managed-schema
   [junit4]   2> 412081 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/solrconfig.xml to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/solrconfig.xml
   [junit4]   2> 412083 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/contractions_it.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/contractions_it.txt
   [junit4]   2> 412085 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/contractions_ca.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/contractions_ca.txt
   [junit4]   2> 412087 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_no.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_no.txt
   [junit4]   2> 412091 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stemdict_nl.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stemdict_nl.txt
   [junit4]   2> 412092 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_hy.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_hy.txt
   [junit4]   2> 412094 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_id.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_id.txt
   [junit4]   2> 412095 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_et.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_et.txt
   [junit4]   2> 412098 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_hi.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_hi.txt
   [junit4]   2> 412099 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_da.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_da.txt
   [junit4]   2> 412101 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ga.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_ga.txt
   [junit4]   2> 412102 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ja.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_ja.txt
   [junit4]   2> 412104 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_pt.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_pt.txt
   [junit4]   2> 412105 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_hu.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_hu.txt
   [junit4]   2> 412113 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_el.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_el.txt
   [junit4]   2> 412115 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ru.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_ru.txt
   [junit4]   2> 412117 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_tr.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_tr.txt
   [junit4]   2> 412118 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ar.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_ar.txt
   [junit4]   2> 412120 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/userdict_ja.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/userdict_ja.txt
   [junit4]   2> 412122 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_it.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_it.txt
   [junit4]   2> 412124 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_eu.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_eu.txt
   [junit4]   2> 412126 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_cz.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_cz.txt
   [junit4]   2> 412127 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stoptags_ja.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stoptags_ja.txt
   [junit4]   2> 412129 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/contractions_fr.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/contractions_fr.txt
   [junit4]   2> 412131 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_fa.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_fa.txt
   [junit4]   2> 412133 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_de.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_de.txt
   [junit4]   2> 412135 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/contractions_ga.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/contractions_ga.txt
   [junit4]   2> 412136 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ca.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_ca.txt
   [junit4]   2> 412138 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_nl.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_nl.txt
   [junit4]   2> 412141 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_bg.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_bg.txt
   [junit4]   2> 412143 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_es.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_es.txt
   [junit4]   2> 412146 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_en.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_en.txt
   [junit4]   2> 412148 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_lv.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_lv.txt
   [junit4]   2> 412149 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_th.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_th.txt
   [junit4]   2> 412151 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ro.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_ro.txt
   [junit4]   2> 412152 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_fr.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_fr.txt
   [junit4]   2> 412154 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_sv.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_sv.txt
   [junit4]   2> 412155 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_fi.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_fi.txt
   [junit4]   2> 412157 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/hyphenations_ga.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/hyphenations_ga.txt
   [junit4]   2> 412158 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_gl.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/lang/stopwords_gl.txt
   [junit4]   2> 412162 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/synonyms.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/synonyms.txt
   [junit4]   2> 412165 INFO  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/stopwords.txt to /configs/AutoscalingHistoryHandlerTest_collection.AUTOCREATED/stopwords.txt
   [junit4]   2> 412169 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 1, message = {
   [junit4]   2>   "name":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "fromApi":"true",
   [junit4]   2>   "numShards":"1",
   [junit4]   2>   "maxShardsPerNode":"3",
   [junit4]   2>   "createNodeSet":"127.0.0.1:33117_solr",
   [junit4]   2>   "nrtReplicas":"3",
   [junit4]   2>   "stateFormat":"2",
   [junit4]   2>   "replicationFactor":"3",
   [junit4]   2>   "operation":"create"} current state version: 0
   [junit4]   2> 412169 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ClusterStateMutator building a new cName: AutoscalingHistoryHandlerTest_collection
   [junit4]   2> 412270 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ZkStateWriter going to create_collection /collections/AutoscalingHistoryHandlerTest_collection/state.json
   [junit4]   2> 412371 WARN  (OverseerThreadFactory-4308-thread-2-processing-n:127.0.0.1:36561_solr) [n:127.0.0.1:36561_solr     ] o.a.s.c.a.c.CreateCollectionCmd Specified number of replicas of 3 on collection AutoscalingHistoryHandlerTest_collection is higher than the number of Solr instances currently live or live and part of your createNodeSet(1). It's unusual to run two replica of the same slice on the same Solr-instance.
   [junit4]   2> 412375 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 1, message = {
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} current state version: 0
   [junit4]   2> 412375 INFO  (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 412377 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator Old Slice: shard1:{
   [junit4]   2>   "range":"80000000-7fffffff",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "replicas":{}}
   [junit4]   2> 412377 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator New Slice: shard1:{
   [junit4]   2>   "range":"80000000-7fffffff",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "replicas":{"core_node3":{
   [junit4]   2>       "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:33117/solr"}}}
   [junit4]   2> 412378 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 2, message = {
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n2",
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} current state version: 0
   [junit4]   2> 412378 INFO  (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n2",
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 412379 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator Old Slice: shard1:{
   [junit4]   2>   "range":"80000000-7fffffff",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "replicas":{"core_node3":{
   [junit4]   2>       "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:33117/solr"}}}
   [junit4]   2> 412379 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator New Slice: shard1:{
   [junit4]   2>   "range":"80000000-7fffffff",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "replicas":{
   [junit4]   2>     "core_node3":{
   [junit4]   2>       "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:33117/solr"},
   [junit4]   2>     "core_node5":{
   [junit4]   2>       "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n2",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:33117/solr"}}}
   [junit4]   2> 412380 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 3, message = {
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n4",
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} current state version: 0
   [junit4]   2> 412380 INFO  (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n4",
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 412381 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator Old Slice: shard1:{
   [junit4]   2>   "range":"80000000-7fffffff",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "replicas":{
   [junit4]   2>     "core_node3":{
   [junit4]   2>       "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:33117/solr"},
   [junit4]   2>     "core_node5":{
   [junit4]   2>       "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n2",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:33117/solr"}}}
   [junit4]   2> 412381 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.SliceMutator New Slice: shard1:{
   [junit4]   2>   "range":"80000000-7fffffff",
   [junit4]   2>   "state":"active",
   [junit4]   2>   "replicas":{
   [junit4]   2>     "core_node3":{
   [junit4]   2>       "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:33117/solr"},
   [junit4]   2>     "core_node5":{
   [junit4]   2>       "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n2",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:33117/solr"},
   [junit4]   2>     "core_node6":{
   [junit4]   2>       "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n4",
   [junit4]   2>       "state":"down",
   [junit4]   2>       "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>       "type":"NRT",
   [junit4]   2>       "base_url":"https://127.0.0.1:33117/solr"}}}
   [junit4]   2> 412482 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ZkStateWriter going to update_collection /collections/AutoscalingHistoryHandlerTest_collection/state.json version: 0
   [junit4]   2> 412631 DEBUG (ScheduledTrigger-4306-thread-1) [     ] o.a.s.c.a.NodeLostTrigger Running NodeLostTrigger: .auto_add_replicas with currently live nodes: 2 and last live nodes: 2
   [junit4]   2> 412635 INFO  (qtp2004988603-6532) [n:127.0.0.1:33117_solr    x:AutoscalingHistoryHandlerTest_collection_shard1_replica_n2 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node5&collection.configName=AutoscalingHistoryHandlerTest_collection.AUTOCREATED&newCollection=true&name=AutoscalingHistoryHandlerTest_collection_shard1_replica_n2&action=CREATE&numShards=1&collection=AutoscalingHistoryHandlerTest_collection&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 412642 INFO  (qtp2004988603-6528) [n:127.0.0.1:33117_solr    x:AutoscalingHistoryHandlerTest_collection_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node3&collection.configName=AutoscalingHistoryHandlerTest_collection.AUTOCREATED&newCollection=true&name=AutoscalingHistoryHandlerTest_collection_shard1_replica_n1&action=CREATE&numShards=1&collection=AutoscalingHistoryHandlerTest_collection&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 412647 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 1, message = {
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>   "core_node_name":"core_node3",
   [junit4]   2>   "roles":null,
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "numShards":"1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false",
   [junit4]   2>   "operation":"state"} current state version: 0
   [junit4]   2> 412647 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Update state numShards=1 message={
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>   "core_node_name":"core_node3",
   [junit4]   2>   "roles":null,
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "numShards":"1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false",
   [junit4]   2>   "operation":"state"}
   [junit4]   2> 412647 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Will update state for replica: core_node3:{
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false"}
   [junit4]   2> 412647 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Collection is now: DocCollection(AutoscalingHistoryHandlerTest_collection//collections/AutoscalingHistoryHandlerTest_collection/state.json/1 )={
   [junit4]   2>   "pullReplicas":"0",
   [junit4]   2>   "replicationFactor":"3",
   [junit4]   2>   "router":{"name":"compositeId"},
   [junit4]   2>   "maxShardsPerNode":"3",
   [junit4]   2>   "autoAddReplicas":"false",
   [junit4]   2>   "nrtReplicas":"3",
   [junit4]   2>   "tlogReplicas":"0",
   [junit4]   2>   "shards":{"shard1":{
   [junit4]   2>       "range":"80000000-7fffffff",
   [junit4]   2>       "state":"active",
   [junit4]   2>       "replicas":{
   [junit4]   2>         "core_node3":{
   [junit4]   2>           "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n1",
   [junit4]   2>           "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>           "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>           "state":"down",
   [junit4]   2>           "type":"NRT",
   [junit4]   2>           "force_set_state":"false"},
   [junit4]   2>         "core_node5":{
   [junit4]   2>           "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n2",
   [junit4]   2>           "state":"down",
   [junit4]   2>           "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>           "type":"NRT",
   [junit4]   2>           "base_url":"https://127.0.0.1:33117/solr"},
   [junit4]   2>         "core_node6":{
   [junit4]   2>           "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n4",
   [junit4]   2>           "state":"down",
   [junit4]   2>           "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>           "type":"NRT",
   [junit4]   2>           "base_url":"https://127.0.0.1:33117/solr"}}}}}
   [junit4]   2> 412650 INFO  (qtp2004988603-6534) [n:127.0.0.1:33117_solr    x:AutoscalingHistoryHandlerTest_collection_shard1_replica_n4 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node6&collection.configName=AutoscalingHistoryHandlerTest_collection.AUTOCREATED&newCollection=true&name=AutoscalingHistoryHandlerTest_collection_shard1_replica_n4&action=CREATE&numShards=1&collection=AutoscalingHistoryHandlerTest_collection&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 412654 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.Overseer processMessage: queueSize: 2, message = {
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n4",
   [junit4]   2>   "core_node_name":"core_node6",
   [junit4]   2>   "roles":null,
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "numShards":"1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false",
   [junit4]   2>   "operation":"state"} current state version: 0
   [junit4]   2> 412654 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Update state numShards=1 message={
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n4",
   [junit4]   2>   "core_node_name":"core_node6",
   [junit4]   2>   "roles":null,
   [junit4]   2>   "node_name":"127.0.0.1:33117_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:33117/solr",
   [junit4]   2>   "numShards":"1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "collection":"AutoscalingHistoryHandlerTest_collection",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "force_set_state":"false",
   [junit4]   2>   "operation":"state"}
   [junit4]   2> 412654 DEBUG (OverseerStateUpdate-74231785503653894-127.0.0.1:36561_solr-n_0000000000) [n:127.0.0.1:36561_solr     ] o.a.s.c.o.ReplicaMutator Will update state for replica: core_node6:{
   [junit4]   2>   "core":"AutoscalingHistoryHandlerTest_collection_shard1_replica_n4",
   [junit4]   2>   "node_name":"127.0.0.1:

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

   [junit4]   2> 626610 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[2]} 0 0
   [junit4]   2> 626610 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[3]} 0 0
   [junit4]   2> 626611 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[4]} 0 0
   [junit4]   2> 626611 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[5]} 0 0
   [junit4]   2> 626611 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[5]} 0 0
   [junit4]   2> 626611 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[6]} 0 0
   [junit4]   2> 626612 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[7]} 0 0
   [junit4]   2> 626612 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[8]} 0 0
   [junit4]   2> 626612 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[9]} 0 0
   [junit4]   2> 626612 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[10]} 0 0
   [junit4]   2> 626613 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[10]} 0 0
   [junit4]   2> 626613 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[11]} 0 0
   [junit4]   2> 626613 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[12]} 0 0
   [junit4]   2> 626613 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[13]} 0 0
   [junit4]   2> 626614 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[14]} 0 0
   [junit4]   2> 626614 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[15]} 0 0
   [junit4]   2> 626615 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[15]} 0 0
   [junit4]   2> 626615 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[16]} 0 0
   [junit4]   2> 626616 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[17]} 0 0
   [junit4]   2> 626616 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[18]} 0 0
   [junit4]   2> 626616 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{add=[19]} 0 0
   [junit4]   2> 626623 INFO  (searcherExecutor-6111-thread-1-processing-x:collection1) [    x:collection1 ] o.a.s.c.SolrCore [collection1]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 626623 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [    x:collection1 ] o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=null path=null params={}{commit=} 0 6
   [junit4]   2> 626631 INFO  (TEST-TestFiltering.testLiveDocsSharing-seed#[FE32852D365A4D1B]) [     ] o.a.s.SolrTestCaseJ4 ###Ending testLiveDocsSharing
   [junit4]   2> 626631 INFO  (SUITE-TestFiltering-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.SolrTestCaseJ4 ###deleteCore
   [junit4]   2> 626632 INFO  (SUITE-TestFiltering-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=650605246
   [junit4]   2> 626639 INFO  (coreCloseExecutor-6116-thread-1) [     ] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore org.apache.solr.core.SolrCore@3afeb695
   [junit4]   2> 626639 INFO  (coreCloseExecutor-6116-thread-1) [     ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.collection1 tag=SolrCore@3afeb695
   [junit4]   2> 626639 INFO  (coreCloseExecutor-6116-thread-1) [     ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@2493ff0f: rootName = null, domain = solr.core.collection1, service url = null, agent id = null] for registry solr.core.collection1/com.codahale.metrics.MetricRegistry@482c72ea
   [junit4]   2> 626658 INFO  (coreCloseExecutor-6116-thread-1) [     ] o.a.s.u.DirectUpdateHandler2 Committing on IndexWriter.close()  ... SKIPPED (unnecessary).
   [junit4]   2> 626674 INFO  (SUITE-TestFiltering-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.node tag=null
   [junit4]   2> 626674 INFO  (SUITE-TestFiltering-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@73eae156: rootName = null, domain = solr.node, service url = null, agent id = null] for registry solr.node/com.codahale.metrics.MetricRegistry@5d331e23
   [junit4]   2> 626679 INFO  (SUITE-TestFiltering-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jvm tag=null
   [junit4]   2> 626679 INFO  (SUITE-TestFiltering-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@72c68a66: rootName = null, domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm/com.codahale.metrics.MetricRegistry@4d54fd9c
   [junit4]   2> 626682 INFO  (SUITE-TestFiltering-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty tag=null
   [junit4]   2> 626682 INFO  (SUITE-TestFiltering-seed#[FE32852D365A4D1B]-worker) [     ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@51bf8f2e: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty/com.codahale.metrics.MetricRegistry@630798af
   [junit4]   2> NOTE: leaving temporary files on disk at: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J1/temp/solr.search.TestFiltering_FE32852D365A4D1B-001
   [junit4]   2> NOTE: test params are: codec=Lucene87, sim=Asserting(RandomSimilarity(queryNorm=true): {}), locale=id-ID, timezone=Indian/Reunion
   [junit4]   2> NOTE: Linux 5.4.0-45-generic amd64/Oracle Corporation 1.8.0_291 (64-bit)/cpus=4,threads=1,free=105190528,total=535298048
   [junit4]   2> NOTE: All tests run in this JVM: [IndexBasedSpellCheckerTest, TestSimClusterStateProvider, BlockDirectoryTest, TestTolerantUpdateProcessorCloud, CdcrRequestHandlerTest, TestDynamicFieldCollectionResource, TestSolrCloudSnapshots, DistributedQueryComponentOptimizationTest, TestFieldCacheSort, ZkFailoverTest, TestDynamicURP, VersionInfoTest, TestSort, RequestHandlersTest, CloudMLTQParserTest, LukeRequestHandlerTest, DeleteByIdWithRouterFieldTest, SolrCLIZkUtilsTest, TestConfigSetProperties, TestRandomRequestDistribution, Tagger2Test, TestReplicationHandlerDiskOverFlow, HdfsBasicDistributedZk2Test, TestPointFields, TestSubQueryTransformer, CrossCollectionJoinQueryTest, NestedShardedAtomicUpdateTest, TestExtendedDismaxParser, HLLUtilTest, ProtectedTermFilterFactoryTest, SolrCoreTest, TestSolrQueryResponse, TestCaffeineCache, TestEmbeddedSolrServerAdminHandler, TestCloudPseudoReturnFields, NodeAddedTriggerTest, TestCorePropertiesReload, UUIDFieldTest, TestPerFieldSimilarity, SplitByPrefixTest, BasicAuthOnSingleNodeTest, TestSmileRequest, TestLegacyFieldCache, TestJsonRangeFacets, TestNRTOpen, TolerantUpdateProcessorTest, TestSolrCloudWithHadoopAuthPlugin, PeerSyncWithLeaderTest, LeaderElectionIntegrationTest, TestSha256AuthenticationProvider, TestAnalyzedSuggestions, TriggerCooldownIntegrationTest, TestSolrCloudWithDelegationTokens, TestMultiWordSynonyms, TestRTGBase, OverseerSolrResponseUnsafeSerializationTest, TestSolrDeletionPolicy2, AdminHandlersProxyTest, TestClusterProperties, IndexSizeTriggerTest, UpdateRequestProcessorFactoryTest, RoutingToNodesWithPropertiesTest, UnloadDistributedZkTest, TestSchemaSimilarityResource, ReplicationFactorTest, TestFiltering]
   [junit4] Completed [296/947 (2!)] on J1 in 6.02s, 4 tests, 1 failure <<< FAILURES!

[...truncated 56417 lines...]

[JENKINS] Lucene » Lucene-Solr-BadApples-Tests-8.x - Build # 407 - Still Unstable!

Posted by Apache Jenkins Server <je...@builds.apache.org>.
Build: https://ci-builds.apache.org/job/Lucene/job/Lucene-Solr-BadApples-Tests-8.x/407/

1 tests failed.
FAILED:  junit.framework.TestSuite.org.apache.solr.handler.designer.TestSchemaDesignerAPI

Error Message:
Still waiting to see all collections removed from clusterstate.

Stack Trace:
java.lang.IllegalStateException: Still waiting to see all collections removed from clusterstate.
	at __randomizedtesting.SeedInfo.seed([EC619532A6EC9A9E]:0)
	at org.apache.solr.cloud.MiniSolrCloudCluster.deleteAllCollections(MiniSolrCloudCluster.java:567)
	at org.apache.solr.handler.designer.TestSchemaDesignerAPI.tearDownCluster(TestSchemaDesignerAPI.java:82)
	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$7.evaluate(RandomizedRunner.java:901)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
	at org.junit.rules.RunRules.evaluate(RunRules.java:20)
	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 org.junit.rules.RunRules.evaluate(RunRules.java:20)
	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 16071 lines...]
   [junit4] Suite: org.apache.solr.handler.designer.TestSchemaDesignerAPI
   [junit4]   2> 1995678 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.SolrTestCase Setting 'solr.default.confdir' system property to test-framework derived value of '/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/server/solr/configsets/_default/conf'
   [junit4]   2> 1995679 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.SolrTestCaseJ4 Created dataDir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/data-dir-160-001
   [junit4]   2> 1995679 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true) w/NUMERIC_DOCVALUES_SYSPROP=true
   [junit4]   2> 1995680 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.SolrTestCaseJ4 Randomized ssl (true) and clientAuth (false) via: @org.apache.solr.util.RandomizeSSL(reason=, ssl=NaN, value=NaN, clientAuth=NaN)
   [junit4]   2> 1995681 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
   [junit4]   2> 1995681 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.SolrCloudTestCase Using per-replica state
   [junit4]   2> 1995681 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.MiniSolrCloudCluster Starting cluster of 1 servers in /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001
   [junit4]   2> 1995681 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
   [junit4]   2> 1995682 INFO  (ZkTestServer Run Thread) [     ] o.a.s.c.ZkTestServer client port: 0.0.0.0/0.0.0.0:0
   [junit4]   2> 1995682 INFO  (ZkTestServer Run Thread) [     ] o.a.s.c.ZkTestServer Starting server
   [junit4]   2> 1995682 WARN  (ZkTestServer Run Thread) [     ] o.a.z.s.ServerCnxnFactory maxCnxns is not configured, using default value 0.
   [junit4]   2> 1995784 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.ZkTestServer start zk server on port: 38179
   [junit4]   2> 1995784 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.ZkTestServer waitForServerUp: 127.0.0.1:38179
   [junit4]   2> 1995784 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:38179
   [junit4]   2> 1995784 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.ZkTestServer connecting to 127.0.0.1 38179
   [junit4]   2> 1995790 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 1995793 INFO  (zkConnectionManagerCallback-20543-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 1995793 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 1995809 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 1995813 INFO  (zkConnectionManagerCallback-20545-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 1995813 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 1995816 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 1995817 INFO  (zkConnectionManagerCallback-20547-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 1995817 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 1995824 WARN  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker-SendThread(127.0.0.1:38179)) [     ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x101611828800002.
   [junit4]   2>           => EndOfStreamException: Unable to read additional data from server sessionid 0x101611828800002, likely server has closed socket
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77)
   [junit4]   2> org.apache.zookeeper.ClientCnxn$EndOfStreamException: Unable to read additional data from server sessionid 0x101611828800002, likely server has closed socket
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxnSocketNIO.doIO(ClientCnxnSocketNIO.java:77) ~[zookeeper-3.6.2.jar:3.6.2]
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxnSocketNIO.doTransport(ClientCnxnSocketNIO.java:350) ~[zookeeper-3.6.2.jar:3.6.2]
   [junit4]   2> 	at org.apache.zookeeper.ClientCnxn$SendThread.run(ClientCnxn.java:1275) [zookeeper-3.6.2.jar:3.6.2]
   [junit4]   2> 1995927 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
   [junit4]   2> 1995928 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
   [junit4]   2> 1995928 INFO  (jetty-launcher-20548-thread-1) [     ] o.e.j.s.Server jetty-9.4.41.v20210516; built: 2021-05-16T23:56:28.993Z; git: 98607f93c7833e7dc59489b13f3cb0a114fb9f4c; jvm 1.8.0_291-b10
   [junit4]   2> 1995928 INFO  (jetty-launcher-20548-thread-1) [     ] o.e.j.s.session DefaultSessionIdManager workerName=node0
   [junit4]   2> 1995928 INFO  (jetty-launcher-20548-thread-1) [     ] o.e.j.s.session No SessionScavenger set, using defaults
   [junit4]   2> 1995928 INFO  (jetty-launcher-20548-thread-1) [     ] o.e.j.s.session node0 Scavenging every 600000ms
   [junit4]   2> 1995928 INFO  (jetty-launcher-20548-thread-1) [     ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@554aec38{/solr,null,AVAILABLE}
   [junit4]   2> 1995929 INFO  (jetty-launcher-20548-thread-1) [     ] o.e.j.s.AbstractConnector Started ServerConnector@570fa9c9{SSL, (ssl, http/1.1)}{127.0.0.1:45635}
   [junit4]   2> 1995929 INFO  (jetty-launcher-20548-thread-1) [     ] o.e.j.s.Server Started @1995959ms
   [junit4]   2> 1995929 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, zkHost=127.0.0.1:38179/solr, hostPort=45635}
   [junit4]   2> 1995929 ERROR (jetty-launcher-20548-thread-1) [     ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
   [junit4]   2> 1995929 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> 1995929 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr™ version 8.11.0
   [junit4]   2> 1995929 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 1995929 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr
   [junit4]   2> 1995929 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 2021-09-21T08:56:08.290Z
   [junit4]   2> 1995930 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 1995931 INFO  (zkConnectionManagerCallback-20550-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 1995931 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 1995932 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 1995935 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.c.SolrXmlConfig Metrics collection is disabled.
   [junit4]   2> 1997193 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
   [junit4]   2> 1997194 WARN  (jetty-launcher-20548-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> 1997194 WARN  (jetty-launcher-20548-thread-1) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@6482c7a6[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 1997194 WARN  (jetty-launcher-20548-thread-1) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@6482c7a6[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 1997200 WARN  (jetty-launcher-20548-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> 1997203 WARN  (jetty-launcher-20548-thread-1) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@72069c9[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 1997203 WARN  (jetty-launcher-20548-thread-1) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@72069c9[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 1997205 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:38179/solr
   [junit4]   2> 1997206 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 1997210 INFO  (zkConnectionManagerCallback-20561-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 1997210 INFO  (jetty-launcher-20548-thread-1) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 1997420 INFO  (jetty-launcher-20548-thread-1) [n:127.0.0.1:45635_solr     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 1997424 INFO  (zkConnectionManagerCallback-20563-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 1997424 INFO  (jetty-launcher-20548-thread-1) [n:127.0.0.1:45635_solr     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 1997886 WARN  (jetty-launcher-20548-thread-1) [n:127.0.0.1:45635_solr     ] o.a.s.c.ZkController Contents of zookeeper /security.json are world-readable; consider setting up ACLs as described in https://solr.apache.org/guide/zookeeper-access-control.html
   [junit4]   2> 1997895 INFO  (jetty-launcher-20548-thread-1) [n:127.0.0.1:45635_solr     ] o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:45635_solr
   [junit4]   2> 1997896 INFO  (jetty-launcher-20548-thread-1) [n:127.0.0.1:45635_solr     ] o.a.s.c.Overseer Overseer (id=72445825401225221-127.0.0.1:45635_solr-n_0000000000) starting
   [junit4]   2> 1997907 INFO  (OverseerStateUpdate-72445825401225221-127.0.0.1:45635_solr-n_0000000000) [n:127.0.0.1:45635_solr     ] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:45635_solr
   [junit4]   2> 1997919 INFO  (jetty-launcher-20548-thread-1) [n:127.0.0.1:45635_solr     ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:45635_solr
   [junit4]   2> 1997927 INFO  (jetty-launcher-20548-thread-1) [n:127.0.0.1:45635_solr     ] o.a.s.p.PackageLoader /packages.json updated to version -1
   [junit4]   2> 1997928 WARN  (jetty-launcher-20548-thread-1) [n:127.0.0.1:45635_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> 1997933 INFO  (zkCallback-20562-thread-1) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
   [junit4]   2> 1997960 INFO  (jetty-launcher-20548-thread-1) [n:127.0.0.1:45635_solr     ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001/node1
   [junit4]   2> 1997978 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.MiniSolrCloudCluster waitForAllNodes: numServers=1
   [junit4]   2> 1997982 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 1997995 INFO  (zkConnectionManagerCallback-20578-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 1997995 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 1997996 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
   [junit4]   2> 1997997 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38179/solr ready
   [junit4]   2> 1998124 INFO  (OverseerThreadFactory-20570-thread-1-processing-n:127.0.0.1:45635_solr) [n:127.0.0.1:45635_solr     ] o.a.s.c.a.c.CreateCollectionCmd Create collection .system
   [junit4]   2> 1998231 INFO  (OverseerStateUpdate-72445825401225221-127.0.0.1:45635_solr-n_0000000000) [n:127.0.0.1:45635_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":".system_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:45635_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:45635/solr",
   [junit4]   2>   "collection":".system",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 1998608 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr    x:.system_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node2&collection.configName=.system&newCollection=true&name=.system_shard1_replica_n1&action=CREATE&numShards=1&collection=.system&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 1998609 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr    x:.system_shard1_replica_n1 ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient core cache for max 2147483647 cores with initial capacity of 1024
   [junit4]   2> 1998664 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.11.0
   [junit4]   2> 1998664 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ManagedIndexSchemaFactory The schema is configured as managed, but managed schema resource managed-schema not found - loading non-managed schema schema.xml instead
   [junit4]   2> 1998666 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.IndexSchema Schema name=_system collection or core
   [junit4]   2> 1998667 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.IndexSchema Loaded schema _system collection or core/1.1 with uniqueid field id
   [junit4]   2> 1998674 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ManagedIndexSchema Created and persisted managed schema znode at /configs/.system/managed-schema
   [junit4]   2> 1998679 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ManagedIndexSchemaFactory After upgrading to managed schema in ZooKeeper, renamed the non-managed schema /configs/.system/schema.xml to /configs/.system/schema.xml.bak
   [junit4]   2> 1998679 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.CoreContainer Creating SolrCore '.system_shard1_replica_n1' using configuration from configset .system, trusted=true
   [junit4]   2> 1998680 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SolrCore [[.system_shard1_replica_n1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001/node1/.system_shard1_replica_n1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001/node1/.system_shard1_replica_n1/data/]
   [junit4]   2> 1998714 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 1998714 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 1998714 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.CommitTracker Hard AutoCommit: if 1 uncommitted docs; 
   [junit4]   2> 1998714 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 1998715 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/.system
   [junit4]   2> 1998716 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/.system
   [junit4]   2> 1998716 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Creating ZooKeeper watch for the managed schema at /configs/.system/managed-schema
   [junit4]   2> 1998716 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Current schema version 0 is already the latest
   [junit4]   2> 1998716 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 1998716 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1711501026081636352
   [junit4]   2> 1998719 INFO  (searcherExecutor-20580-thread-1-processing-n:127.0.0.1:45635_solr x:.system_shard1_replica_n1 c:.system s:shard1 r:core_node2) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SolrCore [.system_shard1_replica_n1]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 1998727 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/.system/terms/shard1 to Terms{values={core_node2=0}, version=0}
   [junit4]   2> 1998727 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/.system/leaders/shard1
   [junit4]   2> 1998730 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 1998731 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 1998731 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync replicas to https://127.0.0.1:45635/solr/.system_shard1_replica_n1/
   [junit4]   2> 1998731 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
   [junit4]   2> 1998731 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.SyncStrategy https://127.0.0.1:45635/solr/.system_shard1_replica_n1/ has no replicas
   [junit4]   2> 1998731 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node /collections/.system/leaders/shard1/leader after winning as /collections/.system/leader_elect/shard1/election/72445825401225221-core_node2-n_0000000000
   [junit4]   2> 1998734 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I am the new leader: https://127.0.0.1:45635/solr/.system_shard1_replica_n1/ shard1
   [junit4]   2> 1998835 INFO  (zkCallback-20562-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/.system/state.json] for collection [.system] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 1998836 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.c.ZkController I am the leader, no recovery necessary
   [junit4]   2> 1998842 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node2&collection.configName=.system&newCollection=true&name=.system_shard1_replica_n1&action=CREATE&numShards=1&collection=.system&shard=shard1&wt=javabin&version=2&replicaType=NRT} status=0 QTime=234
   [junit4]   2> 1998845 INFO  (qtp1576518329-34188) [n:127.0.0.1:45635_solr     ] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 45 seconds. Check all shard replicas
   [junit4]   2> 1998956 INFO  (zkCallback-20562-thread-2) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/.system/state.json] for collection [.system] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 1998956 INFO  (zkCallback-20562-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/.system/state.json] for collection [.system] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 1999083 INFO  (qtp1576518329-34188) [n:127.0.0.1:45635_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections params={pullReplicas=0&name=.system&nrtReplicas=1&action=CREATE&numShards=1&tlogReplicas=0&wt=javabin&version=2} status=0 QTime=964
   [junit4]   2> 1999084 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.MiniSolrCloudCluster waitForActiveCollection: .system
   [junit4]   2> 1999108 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.SolrTestCaseJ4 ###Starting testSchemaDiffEndpoint
   [junit4]   2> 1999149 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default to /configs/._designer_testDiff
   [junit4]   2> 1999150 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/protwords.txt to /configs/._designer_testDiff/protwords.txt
   [junit4]   2> 1999151 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/managed-schema to /configs/._designer_testDiff/managed-schema
   [junit4]   2> 1999155 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/solrconfig.xml to /configs/._designer_testDiff/solrconfig.xml
   [junit4]   2> 1999163 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/contractions_it.txt to /configs/._designer_testDiff/lang/contractions_it.txt
   [junit4]   2> 1999177 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_no.txt to /configs/._designer_testDiff/lang/stopwords_no.txt
   [junit4]   2> 1999186 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/contractions_ca.txt to /configs/._designer_testDiff/lang/contractions_ca.txt
   [junit4]   2> 1999194 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stemdict_nl.txt to /configs/._designer_testDiff/lang/stemdict_nl.txt
   [junit4]   2> 1999198 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_hy.txt to /configs/._designer_testDiff/lang/stopwords_hy.txt
   [junit4]   2> 1999207 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_id.txt to /configs/._designer_testDiff/lang/stopwords_id.txt
   [junit4]   2> 1999211 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_et.txt to /configs/._designer_testDiff/lang/stopwords_et.txt
   [junit4]   2> 1999214 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ga.txt to /configs/._designer_testDiff/lang/stopwords_ga.txt
   [junit4]   2> 1999217 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_da.txt to /configs/._designer_testDiff/lang/stopwords_da.txt
   [junit4]   2> 1999220 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_hi.txt to /configs/._designer_testDiff/lang/stopwords_hi.txt
   [junit4]   2> 1999223 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ja.txt to /configs/._designer_testDiff/lang/stopwords_ja.txt
   [junit4]   2> 1999226 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_pt.txt to /configs/._designer_testDiff/lang/stopwords_pt.txt
   [junit4]   2> 1999232 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_hu.txt to /configs/._designer_testDiff/lang/stopwords_hu.txt
   [junit4]   2> 1999234 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_el.txt to /configs/._designer_testDiff/lang/stopwords_el.txt
   [junit4]   2> 1999237 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ru.txt to /configs/._designer_testDiff/lang/stopwords_ru.txt
   [junit4]   2> 1999239 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_tr.txt to /configs/._designer_testDiff/lang/stopwords_tr.txt
   [junit4]   2> 1999242 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ar.txt to /configs/._designer_testDiff/lang/stopwords_ar.txt
   [junit4]   2> 1999245 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/userdict_ja.txt to /configs/._designer_testDiff/lang/userdict_ja.txt
   [junit4]   2> 1999248 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_it.txt to /configs/._designer_testDiff/lang/stopwords_it.txt
   [junit4]   2> 1999251 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_eu.txt to /configs/._designer_testDiff/lang/stopwords_eu.txt
   [junit4]   2> 1999254 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_cz.txt to /configs/._designer_testDiff/lang/stopwords_cz.txt
   [junit4]   2> 1999256 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stoptags_ja.txt to /configs/._designer_testDiff/lang/stoptags_ja.txt
   [junit4]   2> 1999259 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/contractions_fr.txt to /configs/._designer_testDiff/lang/contractions_fr.txt
   [junit4]   2> 1999261 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_de.txt to /configs/._designer_testDiff/lang/stopwords_de.txt
   [junit4]   2> 1999263 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_fa.txt to /configs/._designer_testDiff/lang/stopwords_fa.txt
   [junit4]   2> 1999269 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/contractions_ga.txt to /configs/._designer_testDiff/lang/contractions_ga.txt
   [junit4]   2> 1999271 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ca.txt to /configs/._designer_testDiff/lang/stopwords_ca.txt
   [junit4]   2> 1999273 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_nl.txt to /configs/._designer_testDiff/lang/stopwords_nl.txt
   [junit4]   2> 1999275 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_bg.txt to /configs/._designer_testDiff/lang/stopwords_bg.txt
   [junit4]   2> 1999277 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_en.txt to /configs/._designer_testDiff/lang/stopwords_en.txt
   [junit4]   2> 1999373 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_lv.txt to /configs/._designer_testDiff/lang/stopwords_lv.txt
   [junit4]   2> 1999376 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_es.txt to /configs/._designer_testDiff/lang/stopwords_es.txt
   [junit4]   2> 1999378 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_th.txt to /configs/._designer_testDiff/lang/stopwords_th.txt
   [junit4]   2> 1999380 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_ro.txt to /configs/._designer_testDiff/lang/stopwords_ro.txt
   [junit4]   2> 1999386 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_fr.txt to /configs/._designer_testDiff/lang/stopwords_fr.txt
   [junit4]   2> 1999394 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_sv.txt to /configs/._designer_testDiff/lang/stopwords_sv.txt
   [junit4]   2> 1999400 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_fi.txt to /configs/._designer_testDiff/lang/stopwords_fi.txt
   [junit4]   2> 1999404 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/hyphenations_ga.txt to /configs/._designer_testDiff/lang/hyphenations_ga.txt
   [junit4]   2> 1999407 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/lang/stopwords_gl.txt to /configs/._designer_testDiff/lang/stopwords_gl.txt
   [junit4]   2> 1999410 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/synonyms.txt to /configs/._designer_testDiff/synonyms.txt
   [junit4]   2> 1999411 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/_default/stopwords.txt to /configs/._designer_testDiff/stopwords.txt
   [junit4]   2> 1999423 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.11.0
   [junit4]   2> 1999423 WARN  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead
   [junit4]   2> 1999428 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.s.IndexSchema Schema name=default-config
   [junit4]   2> 1999479 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.s.IndexSchema Loaded schema default-config/1.6 with uniqueid field id
   [junit4]   2> 1999615 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.s.ManagedIndexSchema Persisted managed schema version 1  at /configs/._designer_testDiff/managed-schema
   [junit4]   2> 1999617 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 1999618 INFO  (zkConnectionManagerCallback-20589-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 1999618 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 1999622 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
   [junit4]   2> 1999628 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:38179/solr ready
   [junit4]   2> 1999635 INFO  (OverseerCollectionConfigSetProcessor-72445825401225221-127.0.0.1:45635_solr-n_0000000000) [n:127.0.0.1:45635_solr     ] o.a.s.c.OverseerTaskQueue Response ZK path: /overseer/collection-queue-work/qnr-0000000000 doesn't exist. Requestor may have disconnected from ZooKeeper
   [junit4]   2> 1999635 INFO  (OverseerThreadFactory-20570-thread-2-processing-n:127.0.0.1:45635_solr) [n:127.0.0.1:45635_solr     ] o.a.s.c.a.c.CreateCollectionCmd Create collection ._designer_testDiff
   [junit4]   2> 2000002 INFO  (OverseerStateUpdate-72445825401225221-127.0.0.1:45635_solr-n_0000000000) [n:127.0.0.1:45635_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":"._designer_testDiff_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:45635_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:45635/solr",
   [junit4]   2>   "collection":"._designer_testDiff",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 2000211 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr    x:._designer_testDiff_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node2&collection.configName=._designer_testDiff&newCollection=true&name=._designer_testDiff_shard1_replica_n1&action=CREATE&numShards=1&collection=._designer_testDiff&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 2000226 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.11.0
   [junit4]   2> 2000226 WARN  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead
   [junit4]   2> 2000231 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.IndexSchema Schema name=default-config
   [junit4]   2> 2000241 WARN  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow omitNorms to be specified in schema, hardcoded behavior is omitNorms=true
   [junit4]   2> 2000241 WARN  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow omitTermFreqAndPositions to be specified in schema, hardcoded behavior is omitTermFreqAndPositions=true
   [junit4]   2> 2000241 WARN  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow termOffsets to be specified in schema, hardcoded behavior is termOffsets=false
   [junit4]   2> 2000241 WARN  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow termPositions to be specified in schema, hardcoded behavior is termPositions=false
   [junit4]   2> 2000241 WARN  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow omitPositions to be specified in schema, hardcoded behavior is omitPositions=true
   [junit4]   2> 2000334 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.IndexSchema Loaded schema default-config/1.6 with uniqueid field id
   [junit4]   2> 2000463 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.CoreContainer Creating SolrCore '._designer_testDiff_shard1_replica_n1' using configuration from configset ._designer_testDiff, trusted=true
   [junit4]   2> 2000464 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.SolrCore [[._designer_testDiff_shard1_replica_n1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001/node1/._designer_testDiff_shard1_replica_n1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001/node1/._designer_testDiff_shard1_replica_n1/data/]
   [junit4]   2> 2000505 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 2000505 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 2000506 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.u.CommitTracker Hard AutoCommit: if uncommitted for 15000ms; 
   [junit4]   2> 2000506 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 2000507 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/._designer_testDiff
   [junit4]   2> 2000508 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/._designer_testDiff
   [junit4]   2> 2000508 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Creating ZooKeeper watch for the managed schema at /configs/._designer_testDiff/managed-schema
   [junit4]   2> 2000508 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Current schema version 1 is already the latest
   [junit4]   2> 2000508 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 2000508 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.s.DirectSolrSpellChecker init: {name=default,field=_text_,classname=solr.DirectSolrSpellChecker,distanceMeasure=internal,accuracy=0.5,maxQueryFrequency=0.01,maxEdits=2,minPrefix=1,maxInspections=5,minQueryLength=4}
   [junit4]   2> 2000509 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 2000509 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1711501027961733120
   [junit4]   2> 2000511 INFO  (searcherExecutor-20591-thread-1-processing-n:127.0.0.1:45635_solr x:._designer_testDiff_shard1_replica_n1 c:._designer_testDiff s:shard1 r:core_node2) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.QuerySenderListener QuerySenderListener done.
   [junit4]   2> 2000512 INFO  (searcherExecutor-20591-thread-1-processing-n:127.0.0.1:45635_solr x:._designer_testDiff_shard1_replica_n1 c:._designer_testDiff s:shard1 r:core_node2) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 2000512 INFO  (searcherExecutor-20591-thread-1-processing-n:127.0.0.1:45635_solr x:._designer_testDiff_shard1_replica_n1 c:._designer_testDiff s:shard1 r:core_node2) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.SolrCore [._designer_testDiff_shard1_replica_n1]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 2000516 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/._designer_testDiff/terms/shard1 to Terms{values={core_node2=0}, version=0}
   [junit4]   2> 2000516 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/._designer_testDiff/leaders/shard1
   [junit4]   2> 2000532 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 2000533 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 2000533 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync replicas to https://127.0.0.1:45635/solr/._designer_testDiff_shard1_replica_n1/
   [junit4]   2> 2000534 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
   [junit4]   2> 2000535 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.SyncStrategy https://127.0.0.1:45635/solr/._designer_testDiff_shard1_replica_n1/ has no replicas
   [junit4]   2> 2000535 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node /collections/._designer_testDiff/leaders/shard1/leader after winning as /collections/._designer_testDiff/leader_elect/shard1/election/72445825401225221-core_node2-n_0000000000
   [junit4]   2> 2000539 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I am the new leader: https://127.0.0.1:45635/solr/._designer_testDiff_shard1_replica_n1/ shard1
   [junit4]   2> 2000642 INFO  (zkCallback-20562-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/._designer_testDiff/state.json] for collection [._designer_testDiff] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2000642 INFO  (zkCallback-20562-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/._designer_testDiff/state.json] for collection [._designer_testDiff] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2000645 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr c:._designer_testDiff s:shard1 r:core_node2 x:._designer_testDiff_shard1_replica_n1 ] o.a.s.c.ZkController I am the leader, no recovery necessary
   [junit4]   2> 2000660 INFO  (qtp1576518329-34190) [n:127.0.0.1:45635_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node2&collection.configName=._designer_testDiff&newCollection=true&name=._designer_testDiff_shard1_replica_n1&action=CREATE&numShards=1&collection=._designer_testDiff&shard=shard1&wt=javabin&version=2&replicaType=NRT} status=0 QTime=449
   [junit4]   2> 2000664 INFO  (qtp1576518329-34185) [n:127.0.0.1:45635_solr     ] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 45 seconds. Check all shard replicas
   [junit4]   2> 2000758 INFO  (zkCallback-20562-thread-2) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/._designer_testDiff/state.json] for collection [._designer_testDiff] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2000758 INFO  (zkCallback-20562-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/._designer_testDiff/state.json] for collection [._designer_testDiff] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2000758 INFO  (zkCallback-20562-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/._designer_testDiff/state.json] for collection [._designer_testDiff] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2000763 INFO  (qtp1576518329-34185) [n:127.0.0.1:45635_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections params={collection.configName=._designer_testDiff&maxShardsPerNode=-1&name=._designer_testDiff&nrtReplicas=1&action=CREATE&numShards=1&wt=javabin&version=2} status=0 QTime=1133
   [junit4]   2> 2000763 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 45 seconds. Check all shard replicas
   [junit4]   2> 2000768 INFO  (Thread-7236) [     ] o.a.s.c.SolrCore config update listener called for core ._designer_testDiff_shard1_replica_n1
   [junit4]   2> 2000774 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.c.SolrCore core reload ._designer_testDiff_shard1_replica_n1
   [junit4]   2> 2000784 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.11.0
   [junit4]   2> 2000785 WARN  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead
   [junit4]   2> 2000787 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.IndexSchema Schema name=default-config
   [junit4]   2> 2000795 WARN  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow omitNorms to be specified in schema, hardcoded behavior is omitNorms=true
   [junit4]   2> 2000795 WARN  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow omitTermFreqAndPositions to be specified in schema, hardcoded behavior is omitTermFreqAndPositions=true
   [junit4]   2> 2000795 WARN  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow termOffsets to be specified in schema, hardcoded behavior is termOffsets=false
   [junit4]   2> 2000795 WARN  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow termPositions to be specified in schema, hardcoded behavior is termPositions=false
   [junit4]   2> 2000795 WARN  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow omitPositions to be specified in schema, hardcoded behavior is omitPositions=true
   [junit4]   2> 2000799 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.11.0
   [junit4]   2> 2000799 WARN  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead
   [junit4]   2> 2000800 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff to /configs/testDiff
   [junit4]   2> 2000803 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/protwords.txt to /configs/testDiff/protwords.txt
   [junit4]   2> 2000806 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/managed-schema to /configs/testDiff/managed-schema
   [junit4]   2> 2000811 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/solrconfig.xml to /configs/testDiff/solrconfig.xml
   [junit4]   2> 2000812 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/synonyms.txt to /configs/testDiff/synonyms.txt
   [junit4]   2> 2000876 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/configoverlay.json to /configs/testDiff/configoverlay.json
   [junit4]   2> 2000877 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/stopwords.txt to /configs/testDiff/stopwords.txt
   [junit4]   2> 2000884 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/contractions_it.txt to /configs/testDiff/lang/contractions_it.txt
   [junit4]   2> 2000887 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_no.txt to /configs/testDiff/lang/stopwords_no.txt
   [junit4]   2> 2000891 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/contractions_ca.txt to /configs/testDiff/lang/contractions_ca.txt
   [junit4]   2> 2000896 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stemdict_nl.txt to /configs/testDiff/lang/stemdict_nl.txt
   [junit4]   2> 2000900 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_hy.txt to /configs/testDiff/lang/stopwords_hy.txt
   [junit4]   2> 2000902 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_id.txt to /configs/testDiff/lang/stopwords_id.txt
   [junit4]   2> 2000905 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_et.txt to /configs/testDiff/lang/stopwords_et.txt
   [junit4]   2> 2000907 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_ga.txt to /configs/testDiff/lang/stopwords_ga.txt
   [junit4]   2> 2000909 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_da.txt to /configs/testDiff/lang/stopwords_da.txt
   [junit4]   2> 2000912 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_hi.txt to /configs/testDiff/lang/stopwords_hi.txt
   [junit4]   2> 2000916 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_ja.txt to /configs/testDiff/lang/stopwords_ja.txt
   [junit4]   2> 2000921 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_pt.txt to /configs/testDiff/lang/stopwords_pt.txt
   [junit4]   2> 2000927 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_hu.txt to /configs/testDiff/lang/stopwords_hu.txt
   [junit4]   2> 2000929 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_el.txt to /configs/testDiff/lang/stopwords_el.txt
   [junit4]   2> 2000935 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_ru.txt to /configs/testDiff/lang/stopwords_ru.txt
   [junit4]   2> 2000940 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_tr.txt to /configs/testDiff/lang/stopwords_tr.txt
   [junit4]   2> 2000943 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_ar.txt to /configs/testDiff/lang/stopwords_ar.txt
   [junit4]   2> 2000948 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/userdict_ja.txt to /configs/testDiff/lang/userdict_ja.txt
   [junit4]   2> 2000952 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_it.txt to /configs/testDiff/lang/stopwords_it.txt
   [junit4]   2> 2000956 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_eu.txt to /configs/testDiff/lang/stopwords_eu.txt
   [junit4]   2> 2000961 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_cz.txt to /configs/testDiff/lang/stopwords_cz.txt
   [junit4]   2> 2000965 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stoptags_ja.txt to /configs/testDiff/lang/stoptags_ja.txt
   [junit4]   2> 2000970 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.IndexSchema Loaded schema default-config/1.6 with uniqueid field id
   [junit4]   2> 2000971 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/contractions_fr.txt to /configs/testDiff/lang/contractions_fr.txt
   [junit4]   2> 2000974 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_de.txt to /configs/testDiff/lang/stopwords_de.txt
   [junit4]   2> 2000979 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_fa.txt to /configs/testDiff/lang/stopwords_fa.txt
   [junit4]   2> 2000981 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/contractions_ga.txt to /configs/testDiff/lang/contractions_ga.txt
   [junit4]   2> 2000985 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_ca.txt to /configs/testDiff/lang/stopwords_ca.txt
   [junit4]   2> 2000989 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_nl.txt to /configs/testDiff/lang/stopwords_nl.txt
   [junit4]   2> 2000991 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_bg.txt to /configs/testDiff/lang/stopwords_bg.txt
   [junit4]   2> 2000994 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_en.txt to /configs/testDiff/lang/stopwords_en.txt
   [junit4]   2> 2001000 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_lv.txt to /configs/testDiff/lang/stopwords_lv.txt
   [junit4]   2> 2001002 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_es.txt to /configs/testDiff/lang/stopwords_es.txt
   [junit4]   2> 2001006 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_th.txt to /configs/testDiff/lang/stopwords_th.txt
   [junit4]   2> 2001011 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_ro.txt to /configs/testDiff/lang/stopwords_ro.txt
   [junit4]   2> 2001013 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_fr.txt to /configs/testDiff/lang/stopwords_fr.txt
   [junit4]   2> 2001021 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_sv.txt to /configs/testDiff/lang/stopwords_sv.txt
   [junit4]   2> 2001025 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_fi.txt to /configs/testDiff/lang/stopwords_fi.txt
   [junit4]   2> 2001033 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/hyphenations_ga.txt to /configs/testDiff/lang/hyphenations_ga.txt
   [junit4]   2> 2001035 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.c.c.ZkConfigManager Copying zk node /configs/._designer_testDiff/lang/stopwords_gl.txt to /configs/testDiff/lang/stopwords_gl.txt
   [junit4]   2> 2001048 INFO  (OverseerCollectionConfigSetProcessor-72445825401225221-127.0.0.1:45635_solr-n_0000000000) [n:127.0.0.1:45635_solr     ] o.a.s.c.OverseerTaskQueue Response ZK path: /overseer/collection-queue-work/qnr-0000000002 doesn't exist. Requestor may have disconnected from ZooKeeper
   [junit4]   2> 2001048 INFO  (OverseerThreadFactory-20570-thread-3-processing-n:127.0.0.1:45635_solr) [n:127.0.0.1:45635_solr     ] o.a.s.c.a.c.CreateCollectionCmd Create collection diff456
   [junit4]   2> 2001063 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.c.CoreContainer Reloading SolrCore '._designer_testDiff_shard1_replica_n1' using configuration from configset ._designer_testDiff
   [junit4]   2> 2001063 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.c.SolrCore [[._designer_testDiff_shard1_replica_n1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001/node1/._designer_testDiff_shard1_replica_n1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001/node1/._designer_testDiff_shard1_replica_n1/data/]
   [junit4]   2> 2001142 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.u.CommitTracker Hard AutoCommit: if uncommitted for 15000ms; 
   [junit4]   2> 2001142 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 2001145 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/._designer_testDiff
   [junit4]   2> 2001146 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/._designer_testDiff
   [junit4]   2> 2001146 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.ZkIndexSchemaReader Creating ZooKeeper watch for the managed schema at /configs/._designer_testDiff/managed-schema
   [junit4]   2> 2001147 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.ZkIndexSchemaReader Current schema version 1 is already the latest
   [junit4]   2> 2001147 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 2001147 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.s.DirectSolrSpellChecker init: {name=default,field=_text_,classname=solr.DirectSolrSpellChecker,distanceMeasure=internal,accuracy=0.5,maxQueryFrequency=0.01,maxEdits=2,minPrefix=1,maxInspections=5,minQueryLength=4}
   [junit4]   2> 2001148 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 2001148 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1711501028631773184
   [junit4]   2> 2001150 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used.
   [junit4]   2> 2001151 INFO  (searcherExecutor-20597-thread-1-processing-n:127.0.0.1:45635_solr) [n:127.0.0.1:45635_solr     ] o.a.s.c.QuerySenderListener QuerySenderListener done.
   [junit4]   2> 2001151 INFO  (searcherExecutor-20597-thread-1-processing-n:127.0.0.1:45635_solr) [n:127.0.0.1:45635_solr     ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 2001152 INFO  (searcherExecutor-20597-thread-1-processing-n:127.0.0.1:45635_solr) [n:127.0.0.1:45635_solr     ] o.a.s.c.SolrCore [._designer_testDiff_shard1_replica_n1]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 2001158 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.c.SolrCore [._designer_testDiff_shard1_replica_n1]  CLOSING SolrCore org.apache.solr.core.SolrCore@7bdae6f0
   [junit4]   2> 2001158 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.core.._designer_testDiff.shard1.replica_n1 tag=SolrCore@7bdae6f0
   [junit4]   2> 2001158 INFO  (searcherExecutor-20597-thread-1-processing-n:127.0.0.1:45635_solr) [n:127.0.0.1:45635_solr     ] o.a.s.c.QuerySenderListener QuerySenderListener done.
   [junit4]   2> 2001158 INFO  (searcherExecutor-20597-thread-1-processing-n:127.0.0.1:45635_solr) [n:127.0.0.1:45635_solr     ] o.a.s.c.SolrCore [._designer_testDiff_shard1_replica_n1]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 2001158 INFO  (Thread-7236) [n:127.0.0.1:45635_solr     ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.collection.._designer_testDiff.shard1.leader tag=SolrCore@7bdae6f0
   [junit4]   2> 2001286 INFO  (OverseerStateUpdate-72445825401225221-127.0.0.1:45635_solr-n_0000000000) [n:127.0.0.1:45635_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":"diff456_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:45635_solr",
   [junit4]   2>   "base_url":"https://127.0.0.1:45635/solr",
   [junit4]   2>   "collection":"diff456",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 2001539 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr    x:diff456_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node2&collection.configName=testDiff&newCollection=true&name=diff456_shard1_replica_n1&action=CREATE&numShards=1&collection=diff456&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 2001560 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.11.0
   [junit4]   2> 2001560 WARN  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.SolrConfig solrconfig.xml: <jmx> is no longer supported, use solr.xml:/metrics/reporter section instead
   [junit4]   2> 2001565 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.IndexSchema Schema name=default-config
   [junit4]   2> 2001573 WARN  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow omitNorms to be specified in schema, hardcoded behavior is omitNorms=true
   [junit4]   2> 2001573 WARN  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow omitTermFreqAndPositions to be specified in schema, hardcoded behavior is omitTermFreqAndPositions=true
   [junit4]   2> 2001573 WARN  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow termOffsets to be specified in schema, hardcoded behavior is termOffsets=false
   [junit4]   2> 2001573 WARN  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow termPositions to be specified in schema, hardcoded behavior is termPositions=false
   [junit4]   2> 2001573 WARN  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.AbstractSpatialPrefixTreeFieldType FieldType SpatialRecursivePrefixTreeFieldType does not allow omitPositions to be specified in schema, hardcoded behavior is omitPositions=true
   [junit4]   2> 2001635 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.IndexSchema Loaded schema default-config/1.6 with uniqueid field id
   [junit4]   2> 2001691 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.CoreContainer Creating SolrCore 'diff456_shard1_replica_n1' using configuration from configset testDiff, trusted=true
   [junit4]   2> 2001693 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.SolrCore [[diff456_shard1_replica_n1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001/node1/diff456_shard1_replica_n1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-BadApples-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.handler.designer.TestSchemaDesignerAPI_EC619532A6EC9A9E-001/tempDir-001/node1/diff456_shard1_replica_n1/data/]
   [junit4]   2> 2001810 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 2001810 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 2001810 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.u.CommitTracker Hard AutoCommit: if uncommitted for 15000ms; 
   [junit4]   2> 2001810 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 2001814 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/testDiff
   [junit4]   2> 2001815 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/testDiff
   [junit4]   2> 2001815 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Creating ZooKeeper watch for the managed schema at /configs/testDiff/managed-schema
   [junit4]   2> 2001817 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.ZkIndexSchemaReader Current schema version 0 is already the latest
   [junit4]   2> 2001817 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.h.c.SpellCheckComponent Initializing spell checkers
   [junit4]   2> 2001817 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.s.DirectSolrSpellChecker init: {name=default,field=_text_,classname=solr.DirectSolrSpellChecker,distanceMeasure=internal,accuracy=0.5,maxQueryFrequency=0.01,maxEdits=2,minPrefix=1,maxInspections=5,minQueryLength=4}
   [junit4]   2> 2001820 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 2001821 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1711501029337464832
   [junit4]   2> 2001834 INFO  (searcherExecutor-20602-thread-1-processing-n:127.0.0.1:45635_solr x:diff456_shard1_replica_n1 c:diff456 s:shard1 r:core_node2) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.QuerySenderListener QuerySenderListener done.
   [junit4]   2> 2001834 INFO  (searcherExecutor-20602-thread-1-processing-n:127.0.0.1:45635_solr x:diff456_shard1_replica_n1 c:diff456 s:shard1 r:core_node2) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.h.c.SpellCheckComponent Loading spell index for spellchecker: default
   [junit4]   2> 2001834 INFO  (searcherExecutor-20602-thread-1-processing-n:127.0.0.1:45635_solr x:diff456_shard1_replica_n1 c:diff456 s:shard1 r:core_node2) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.SolrCore [diff456_shard1_replica_n1]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 2001867 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/diff456/terms/shard1 to Terms{values={core_node2=0}, version=0}
   [junit4]   2> 2001867 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/diff456/leaders/shard1
   [junit4]   2> 2001871 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 2001871 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 2001871 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync replicas to https://127.0.0.1:45635/solr/diff456_shard1_replica_n1/
   [junit4]   2> 2001872 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.SyncStrategy Sync Success - now sync replicas to me
   [junit4]   2> 2001873 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.SyncStrategy https://127.0.0.1:45635/solr/diff456_shard1_replica_n1/ has no replicas
   [junit4]   2> 2001873 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node /collections/diff456/leaders/shard1/leader after winning as /collections/diff456/leader_elect/shard1/election/72445825401225221-core_node2-n_0000000000
   [junit4]   2> 2001876 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContext I am the new leader: https://127.0.0.1:45635/solr/diff456_shard1_replica_n1/ shard1
   [junit4]   2> 2001978 INFO  (zkCallback-20562-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/diff456/state.json] for collection [diff456] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2001978 INFO  (zkCallback-20562-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/diff456/state.json] for collection [diff456] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2001983 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr c:diff456 s:shard1 r:core_node2 x:diff456_shard1_replica_n1 ] o.a.s.c.ZkController I am the leader, no recovery necessary
   [junit4]   2> 2001987 INFO  (qtp1576518329-34187) [n:127.0.0.1:45635_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node2&collection.configName=testDiff&newCollection=true&name=diff456_shard1_replica_n1&action=CREATE&numShards=1&collection=diff456&shard=shard1&wt=javabin&version=2&replicaType=NRT} status=0 QTime=449
   [junit4]   2> 2001989 INFO  (qtp1576518329-34188) [n:127.0.0.1:45635_solr     ] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 45 seconds. Check all shard replicas
   [junit4]   2> 2002087 INFO  (zkCallback-20562-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/diff456/state.json] for collection [diff456] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2002087 INFO  (zkCallback-20562-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/diff456/state.json] for collection [diff456] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2002087 INFO  (zkCallback-20562-thread-2) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/diff456/state.json] for collection [diff456] has occurred - updating... (live nodes size: [1])
   [junit4]   2> 2002088 INFO  (qtp1576518329-34188) [n:127.0.0.1:45635_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections params={collection.configName=testDiff&maxShardsPerNode=-1&name=diff456&nrtReplicas=1&action=CREATE&numShards=1&wt=javabin&version=2} status=0 QTime=1048
   [junit4]   2> 2002088 INFO  (TEST-TestSchemaDesignerAPI.testSchemaDiffEndpoint-seed#[EC619532A6EC9A9E]) [     ] o.a.s.h.a.CollectionsHandler Wait for new collection to be active for at most 45 seconds. Check all shard replicas
   [junit4]   2> 2002095 ERROR (qtp1576518329-34185) [n:127.0.0.1:45635_solr c:.system s:shard1 r:core_node2 x:.system_shard1_replica_n1 ] o.a.s.h.RequestHandlerBase org.apache.solr.common.SolrException: Invalid combination of blobName testDiff_sample and version -1
   [junit4]   2> 	at org.apache.solr.handler.BlobHandler.handleRequestBody(BlobHandler.java:203)
   [junit4]   2> 	at org.apache.solr.handler.RequestHandlerBase.handleRequest(RequestHandlerBase.java:216)
   [junit4]   2> 	at org.apache.solr.core.SolrCore.execute(SolrCore.java:2637)
   [junit4]   2> 	at org.apache.solr.servlet.HttpSolrCall.execute(HttpSolrCall.java:794)
   [junit4]   2> 	at org.apache.solr.servlet.HttpSolrCall.call(HttpSolrCall.java:567)
   [junit4]   2> 	at org.apache.solr.servlet.SolrDispatchFilter.doFilter(SolrDispatchFilter.java:427)
   [junit4]   2> 	at org.apache.solr.servlet.SolrDispatchFilter.doFilter(SolrDispatchFilter.java:357)
   [junit4]   2> 	at org.eclipse.jetty.servlet.FilterHolder.doFilter(FilterHolder.java:193)
   [junit4]   2> 	at org.eclipse.jetty.servlet.ServletHandler$Chain.doFilter(ServletHandler.java:1601)
   [junit4]   2> 	at org.apache.solr.client.solrj.embedded.JettySolrRunner$DebugFilter.doFilter(JettySolrRunner.java:166)
   [junit4]   2> 	at org.eclipse.jetty.servlet.FilterHolder.doFilter(FilterHolder.java:193)
   [junit4]   2> 	at org.eclipse.jetty.servlet.ServletHandler$Chain.doFilter(ServletHandler.java:1601)
   [junit4]   2> 	at org.eclipse.jetty.servlet.ServletHandler.doHandle(ServletHandler.java:548)
   [junit4]   2> 	at org.eclipse.jetty.server.handler.ScopedHandler.nextHandle(ScopedHandler.java:233)
   [junit4]   2> 	at org.eclipse.jetty.server.session.SessionHandler.doHandle(SessionHandler.java:1624)
   [junit4]   2> 	at org.eclipse.jetty.server.handler.ScopedHandler.nextHandle(ScopedHandler.java:233)
   [junit4]   2> 	at org.eclips

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

er_testTSV/state.json
   [junit4]   2> 	4	/solr/collections/._designer_techproducts/terms/shard1
   [junit4]   2> 	4	/solr/collections/._designer_films/terms/shard1
   [junit4]   2> 	4	/solr/collections/._designer_films/state.json
   [junit4]   2> 	4	/solr/collections/techproducts/state.json
   [junit4]   2> 	3	/solr/configs/._designer_testTSV/managed-schema
   [junit4]   2> 	3	/solr/configs/._designer_techproducts
   [junit4]   2> 	3	/solr/configs/._designer_films/managed-schema
   [junit4]   2> 	3	/solr/collections/._designer_fieldUpdates/terms/shard1
   [junit4]   2> 	3	/solr/collections/techproducts/terms/shard1
   [junit4]   2> 	3	/solr/collections/diff456/terms/shard1
   [junit4]   2> 	3	/solr/configs/._designer_testTSV
   [junit4]   2> 	2	/solr/configs/techproducts
   [junit4]   2> 	2	/solr/configs/._designer_films
   [junit4]   2> 	2	/solr/configs/techproducts/managed-schema
   [junit4]   2> 
   [junit4]   2> Maximum concurrent data watches above limit:
   [junit4]   2> 
   [junit4]   2> 	30	/solr/collections/._designer_testJson/state.json
   [junit4]   2> 	25	/solr/configs/._designer_techproducts/managed-schema
   [junit4]   2> 	18	/solr/collections/._designer_testDiff/state.json
   [junit4]   2> 	14	/solr/configs/._designer_testJson/managed-schema
   [junit4]   2> 	9	/solr/collections/._designer_testTSV/state.json
   [junit4]   2> 	9	/solr/collections/._designer_techproducts/state.json
   [junit4]   2> 	9	/solr/collections/test123/state.json
   [junit4]   2> 	9	/solr/collections/._designer_films/state.json
   [junit4]   2> 	9	/solr/collections/techproducts/state.json
   [junit4]   2> 	9	/solr/collections/._designer_fieldUpdates/state.json
   [junit4]   2> 	9	/solr/collections/diff456/state.json
   [junit4]   2> 	8	/solr/collections/.system/state.json
   [junit4]   2> 	6	/solr/configs/._designer_fieldUpdates/managed-schema
   [junit4]   2> 	4	/solr/clusterprops.json
   [junit4]   2> 	4	/solr/aliases.json
   [junit4]   2> 	4	/solr/clusterstate.json
   [junit4]   2> 	3	/solr/configs/._designer_testDiff/managed-schema
   [junit4]   2> 
   [junit4]   2> Maximum concurrent children watches above limit:
   [junit4]   2> 
   [junit4]   2> 	188	/solr/overseer/collection-queue-work
   [junit4]   2> 	170	/solr/overseer/queue
   [junit4]   2> 	92	/solr/collections
   [junit4]   2> 	12	/solr/collections/._designer_testJson/state.json
   [junit4]   2> 	8	/solr/collections/._designer_testDiff/state.json
   [junit4]   2> 	5	/solr/collections/.system/state.json
   [junit4]   2> 	5	/solr/live_nodes
   [junit4]   2> 	4	/solr/collections/._designer_testTSV/state.json
   [junit4]   2> 	4	/solr/collections/._designer_techproducts/state.json
   [junit4]   2> 	4	/solr/collections/test123/state.json
   [junit4]   2> 	4	/solr/collections/._designer_films/state.json
   [junit4]   2> 	4	/solr/collections/techproducts/state.json
   [junit4]   2> 	4	/solr/collections/._designer_fieldUpdates/state.json
   [junit4]   2> 	4	/solr/collections/diff456/state.json
   [junit4]   2> 
   [junit4]   2> 2110473 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.ZkTestServer waitForServerDown: 127.0.0.1:38179
   [junit4]   2> 2110473 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:38179
   [junit4]   2> 2110473 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.c.ZkTestServer connecting to 127.0.0.1 38179
   [junit4]   2> 2110473 INFO  (SUITE-TestSchemaDesignerAPI-seed#[EC619532A6EC9A9E]-worker) [     ] o.a.s.SolrTestCaseJ4 ------------------------------------------------------- Done waiting for tracked resources to be released
   [junit4]   2> Sep 21, 2021 8:58:02 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(Lucene87): {blobName=Lucene84, id=PostingsFormat(name=LuceneVarGapDocFreqInterval), type=PostingsFormat(name=Asserting), md5=PostingsFormat(name=Asserting)}, docValues:{size=DocValuesFormat(name=Lucene80), _version_=DocValuesFormat(name=Direct), version=DocValuesFormat(name=Lucene80), timestamp=DocValuesFormat(name=Direct)}, maxPointsInLeafNode=1268, maxMBSortInHeap=7.0906156154774695, sim=Asserting(RandomSimilarity(queryNorm=false): {}), locale=mk-MK, timezone=America/Mendoza
   [junit4]   2> NOTE: Linux 4.15.0-147-generic amd64/Oracle Corporation 1.8.0_291 (64-bit)/cpus=4,threads=1,free=133588296,total=501219328
   [junit4]   2> NOTE: All tests run in this JVM: [DistributedExpandComponentTest, TestHashQParserPlugin, CircularListTest, TestFieldCacheReopen, UniqFieldsUpdateProcessorFactoryTest, DocValuesMissingTest, SolrMetricManagerTest, TestReloadAndDeleteDocs, PathHierarchyTokenizerFactoryTest, ZookeeperStatusHandlerFailureTest, MaxSizeAutoCommitTest, TestSolrDeletionPolicy1, TestObjectReleaseTracker, TestStressRecovery, TestStressCloudBlindAtomicUpdates, PeerSyncWithLeaderAndIndexFingerprintCachingTest, RouteFieldTest, TestConfigSetsAPIShareSchema, TestCloudDeduplication, SecurityHeadersTest, HdfsCollectionsAPIDistributedZkTest, CustomHighlightComponentTest, SignatureUpdateProcessorFactoryTest, TestMissingGroups, TestFieldResource, ShardRoutingCustomTest, PreAnalyzedUpdateProcessorTest, JsonLoaderTest, BasicZkTest, TestLuceneIndexBackCompat, TestSimDistributedQueue, SolrShardReporterTest, RequiredFieldsTest, SuggesterFSTTest, CheckHdfsIndexTest, TestUnifiedSolrHighlighterWithoutStoredId, SpellPossibilityIteratorTest, JSONWriterTest, SolrTestCaseJ4Test, TestNumericRangeQuery32, SolrCmdDistributorTest, ConcurrentCreateCollectionTest, TestQueryUtils, TestExportWriter, ShowFileRequestHandlerTest, CdcrReplicationHandlerTest, OverseerTest, TestRandomFlRTGCloud, RankQParserPluginTest, TestFieldCacheWithThreads, LoggingHandlerTest, CoreAdminHandlerTest, ClassificationUpdateProcessorTest, TestPHPSerializedResponseWriter, TestJettySolrRunner, TestFaceting, SimpleCollectionCreateDeleteTest, MaxScoreCollectorTest, TestSimpleQParserPlugin, DistributedUpdateProcessorTest, TestReRankQParserPlugin, PKIAuthenticationIntegrationTest, ExternalFileFieldSortTest, MultiThreadedOCPTest, TestInitParams, TestDistributedMissingSort, DistributedSuggestComponentTest, AtomicUpdatesTest, TestReload, TestContainerPlugin, TriLevelCompositeIdRoutingTest, SplitShardTest, SolrCoreCheckLockOnStartupTest, BaseCdcrDistributedZkTest, TestCloudSearcherWarming, SystemInfoHandlerTest, TestSurroundQueryParser, HdfsChaosMonkeySafeLeaderTest, ClusterStateMockUtilTest, ExitableDirectoryReaderTest, AliasIntegrationTest, ChaosMonkeySafeLeaderWithPullReplicasTest, TestSchemaResource, TestTlogReplica, UpdateParamsTest, TestPolicyCloud, TestFilteredDocIdSet, OverseerSolrResponseTest, DistributedFacetPivotSmallAdvancedTest, TestIBSimilarityFactory, TestLockTree, TestExclusionRuleCollectionAccess, SolrIndexSearcherTest, TestNestedDocsSort, TestPullReplica, TestInPlaceUpdatesDistrib, ConfigureRecoveryStrategyTest, DaemonStreamApiTest, BinaryUpdateRequestHandlerTest, DynamicMapsTest, NotRequiredUniqueKeyTest, TestRuleBasedAuthorizationWithKerberos, DistanceFunctionTest, CurrencyRangeFacetCloudTest, RuleEngineTest, TestXIncludeConfig, IndexSizeTriggerSizeEstimationTest, TestHdfsCloudBackupRestore, HLLSerializationTest, IgnoreLargeDocumentProcessorFactoryTest, PreAnalyzedFieldManagedSchemaCloudTest, TestJsonFacetsWithNestedObjects, TestCircuitBreaker, ResponseBuilderTest, MetricsHistoryHandlerTest, LeaderElectionContextKeyTest, AnalysisAfterCoreReloadTest, BasicFunctionalityTest, ConvertedLegacyTest, DisMaxRequestHandlerTest, DistributedIntervalFacetingTest, SolrTestCaseJ4DeleteCoreTest, TestGroupingSearch, TestRandomDVFaceting, TestSolrCoreProperties, TestTolerantSearch, TestLuceneMatchVersion, TestWordDelimiterFilterFactory, CollectionPropsTest, CreateCollectionCleanupTest, DeleteInactiveReplicaTest, DeleteReplicaTest, DistribJoinFromCollectionTest, DocValuesNotIndexedTest, HttpPartitionOnCommitTest, HttpPartitionWithTlogReplicasTest, MigrateRouteKeyTest, ReindexCollectionTest, TestDeleteCollectionOnDownNodes, TestDownShardTolerantSearch, TestSSLRandomization, TestSkipOverseerOperations, TestZkChroot, ZkFailoverTest, AssignTest, AsyncCallRequestStatusResponseTest, CollectionReloadTest, CollectionTooManyReplicasTest, HdfsCloudIncrementalBackupTest, HdfsAutoAddReplicasIntegrationTest, HttpTriggerListenerTest, NodeAddedTriggerIntegrationTest, NodeAddedTriggerTest, RestoreTriggerStateTest, TriggerIntegrationTest, TestCoreContainer, TestImplicitCoreProperties, TestInfoStreamLogging, TestMinimalConfig, TestNRTOpen, TestQuerySenderNoQuery, RequestLoggingTest, TestBlobHandler, TestReqParamsAPI, TestSolrConfigHandlerCloud, V2StandaloneTest, XsltUpdateRequestHandlerTest, AutoscalingHistoryHandlerTest, ShardsWhitelistTest, SuggestComponentContextFilterQueryTest, TermVectorComponentDistributedTest, TestHttpShardHandlerFactory, TestSchemaDesignerAPI]
   [junit4]   2> NOTE: reproduce with: ant test  -Dtestcase=TestSchemaDesignerAPI -Dtests.seed=EC619532A6EC9A9E -Dtests.multiplier=2 -Dtests.slow=true -Dtests.badapples=true -Dtests.locale=mk-MK -Dtests.timezone=America/Mendoza -Dtests.asserts=true -Dtests.file.encoding=UTF-8
   [junit4] ERROR   0.00s J0 | TestSchemaDesignerAPI (suite) <<<
   [junit4]    > Throwable #1: java.lang.IllegalStateException: Still waiting to see all collections removed from clusterstate.
   [junit4]    > 	at __randomizedtesting.SeedInfo.seed([EC619532A6EC9A9E]:0)
   [junit4]    > 	at org.apache.solr.cloud.MiniSolrCloudCluster.deleteAllCollections(MiniSolrCloudCluster.java:567)
   [junit4]    > 	at org.apache.solr.handler.designer.TestSchemaDesignerAPI.tearDownCluster(TestSchemaDesignerAPI.java:82)
   [junit4]    > 	at java.lang.Thread.run(Thread.java:748)
   [junit4] Completed [791/947 (1!)] on J0 in 115.66s, 6 tests, 1 error <<< FAILURES!

[...truncated 54728 lines...]