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/03/21 06:55:20 UTC

[JENKINS] Lucene » Lucene-Solr-Tests-8.x - Build # 1827 - Unstable!

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

1 tests failed.
FAILED:  org.apache.solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest.testSimple

Error Message:
Could not find a healthy node to handle the request.

Stack Trace:
org.apache.solr.common.SolrException: Could not find a healthy node to handle the request.
	at __randomizedtesting.SeedInfo.seed([91CAA748369D593:31AF8E8AA49A0142]:0)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.sendRequest(BaseCloudSolrClient.java:1165)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.requestWithRetryOnStaleState(BaseCloudSolrClient.java:934)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.requestWithRetryOnStaleState(BaseCloudSolrClient.java:1048)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.requestWithRetryOnStaleState(BaseCloudSolrClient.java:1048)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.requestWithRetryOnStaleState(BaseCloudSolrClient.java:1048)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.requestWithRetryOnStaleState(BaseCloudSolrClient.java:1048)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.requestWithRetryOnStaleState(BaseCloudSolrClient.java:1048)
	at org.apache.solr.client.solrj.impl.BaseCloudSolrClient.request(BaseCloudSolrClient.java:866)
	at org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:214)
	at org.apache.solr.client.solrj.SolrClient.query(SolrClient.java:1003)
	at org.apache.solr.cloud.api.collections.AbstractIncrementalBackupTest.testSimple(AbstractIncrementalBackupTest.java:174)
	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 13811 lines...]
   [junit4] Suite: org.apache.solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest
   [junit4]   2> 414778 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-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-Tests-8.x/solr/server/solr/configsets/_default/conf'
   [junit4]   2> 414778 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
   [junit4]   2> 414779 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.SolrTestCaseJ4 Created dataDir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/data-dir-25-001
   [junit4]   2> 414779 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true) w/NUMERIC_DOCVALUES_SYSPROP=true
   [junit4]   2> 414780 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (true) via: @org.apache.solr.util.RandomizeSSL(reason=, value=NaN, ssl=NaN, clientAuth=NaN)
   [junit4]   2> 414780 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.SolrCloudTestCase Using per-replica state
   [junit4]   2> 414781 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.MiniSolrCloudCluster Starting cluster of 2 servers in /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001
   [junit4]   2> 414781 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.ZkTestServer STARTING ZK TEST SERVER
   [junit4]   2> 414784 INFO  (ZkTestServer Run Thread) [     ] o.a.s.c.ZkTestServer client port: 0.0.0.0/0.0.0.0:0
   [junit4]   2> 414784 INFO  (ZkTestServer Run Thread) [     ] o.a.s.c.ZkTestServer Starting server
   [junit4]   2> 414785 WARN  (ZkTestServer Run Thread) [     ] o.a.z.s.ServerCnxnFactory maxCnxns is not configured, using default value 0.
   [junit4]   2> 414884 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.ZkTestServer start zk server on port: 39865
   [junit4]   2> 414884 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.ZkTestServer waitForServerUp: 127.0.0.1:39865
   [junit4]   2> 414884 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:39865
   [junit4]   2> 414884 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.ZkTestServer connecting to 127.0.0.1 39865
   [junit4]   2> 414889 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 414896 INFO  (zkConnectionManagerCallback-3107-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 414896 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 414902 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 414906 INFO  (zkConnectionManagerCallback-3109-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 414906 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 414910 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 414911 INFO  (zkConnectionManagerCallback-3111-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 414911 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 414913 WARN  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker-SendThread(127.0.0.1:39865)) [     ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x1040a4bab410002.
   [junit4]   2>           => EndOfStreamException: Unable to read additional data from server sessionid 0x1040a4bab410002, 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 0x1040a4bab410002, 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> 415016 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
   [junit4]   2> 415016 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
   [junit4]   2> 415016 INFO  (jetty-launcher-3112-thread-1) [     ] o.e.j.s.Server jetty-9.4.34.v20201102; built: 2020-11-02T14:15:39.302Z; git: e46af88704a893fc12cb0e3bf46e2c7b48a009e7; jvm 1.8.0_281-b09
   [junit4]   2> 415017 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.s.e.JettySolrRunner Start Jetty (configured port=0, binding port=0)
   [junit4]   2> 415017 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.s.e.JettySolrRunner Trying to start Jetty on port 0 try number 2 ...
   [junit4]   2> 415017 INFO  (jetty-launcher-3112-thread-2) [     ] o.e.j.s.Server jetty-9.4.34.v20201102; built: 2020-11-02T14:15:39.302Z; git: e46af88704a893fc12cb0e3bf46e2c7b48a009e7; jvm 1.8.0_281-b09
   [junit4]   2> 415022 INFO  (jetty-launcher-3112-thread-1) [     ] o.e.j.s.session DefaultSessionIdManager workerName=node0
   [junit4]   2> 415022 INFO  (jetty-launcher-3112-thread-1) [     ] o.e.j.s.session No SessionScavenger set, using defaults
   [junit4]   2> 415022 INFO  (jetty-launcher-3112-thread-1) [     ] o.e.j.s.session node0 Scavenging every 600000ms
   [junit4]   2> 415025 INFO  (jetty-launcher-3112-thread-1) [     ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@7ecdf6c5{/solr,null,AVAILABLE}
   [junit4]   2> 415029 INFO  (jetty-launcher-3112-thread-2) [     ] o.e.j.s.session DefaultSessionIdManager workerName=node0
   [junit4]   2> 415029 INFO  (jetty-launcher-3112-thread-2) [     ] o.e.j.s.session No SessionScavenger set, using defaults
   [junit4]   2> 415029 INFO  (jetty-launcher-3112-thread-2) [     ] o.e.j.s.session node0 Scavenging every 660000ms
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-1) [     ] o.e.j.s.AbstractConnector Started ServerConnector@6a996589{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:41727}
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-1) [     ] o.e.j.s.Server Started @415061ms
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, zkHost=127.0.0.1:39865/solr, hostPort=41727}
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-2) [     ] o.e.j.s.h.ContextHandler Started o.e.j.s.ServletContextHandler@235db78c{/solr,null,AVAILABLE}
   [junit4]   2> 415033 ERROR (jetty-launcher-3112-thread-1) [     ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr™ version 8.9.0
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 2021-03-21T06:02:31.276Z
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-2) [     ] o.e.j.s.AbstractConnector Started ServerConnector@75ced6d7{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:36637}
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-2) [     ] o.e.j.s.Server Started @415061ms
   [junit4]   2> 415033 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.s.e.JettySolrRunner Jetty properties: {hostContext=/solr, zkHost=127.0.0.1:39865/solr, hostPort=36637}
   [junit4]   2> 415034 ERROR (jetty-launcher-3112-thread-2) [     ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be missing or incomplete.
   [junit4]   2> 415034 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.s.SolrDispatchFilter Using logger factory org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> 415034 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr™ version 8.9.0
   [junit4]   2> 415034 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in cloud mode on port null
   [junit4]   2> 415034 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr
   [junit4]   2> 415034 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 2021-03-21T06:02:31.277Z
   [junit4]   2> 415034 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 415035 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 415035 INFO  (zkConnectionManagerCallback-3114-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 415035 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 415036 INFO  (zkConnectionManagerCallback-3116-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 415036 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 415036 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 415036 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.s.SolrDispatchFilter solr.xml found in ZooKeeper. Loading...
   [junit4]   2> 415042 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13, but no JMX reporters were configured - adding default JMX reporter.
   [junit4]   2> 415044 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.SolrXmlConfig MBean server found: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13, but no JMX reporters were configured - adding default JMX reporter.
   [junit4]   2> 415044 WARN  (jetty-launcher-3112-thread-1-SendThread(127.0.0.1:39865)) [     ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x1040a4bab410003.
   [junit4]   2>           => EndOfStreamException: Unable to read additional data from server sessionid 0x1040a4bab410003, 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 0x1040a4bab410003, 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> 415560 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.CoreContainer Allowing use of paths: [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/my backup-001]
   [junit4]   2> 415560 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
   [junit4]   2> 415561 WARN  (jetty-launcher-3112-thread-1) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@3a9fcc51[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 415561 WARN  (jetty-launcher-3112-thread-1) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@3a9fcc51[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 415566 WARN  (jetty-launcher-3112-thread-1) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@45882bbe[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 415566 WARN  (jetty-launcher-3112-thread-1) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@45882bbe[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 415567 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:39865/solr
   [junit4]   2> 415577 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 415578 INFO  (zkConnectionManagerCallback-3130-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 415578 INFO  (jetty-launcher-3112-thread-1) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 415581 WARN  (jetty-launcher-3112-thread-1-SendThread(127.0.0.1:39865)) [     ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x1040a4bab410005.
   [junit4]   2>           => EndOfStreamException: Unable to read additional data from server sessionid 0x1040a4bab410005, 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 0x1040a4bab410005, 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> 415682 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 415683 INFO  (zkConnectionManagerCallback-3132-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 415683 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 415751 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.c.OverseerElectionContext I am going to be the leader 127.0.0.1:41727_solr
   [junit4]   2> 415752 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.c.Overseer Overseer (id=73194814056759302-127.0.0.1:41727_solr-n_0000000000) starting
   [junit4]   2> 415755 INFO  (OverseerStateUpdate-73194814056759302-127.0.0.1:41727_solr-n_0000000000) [n:127.0.0.1:41727_solr     ] o.a.s.c.Overseer Starting to work on the main queue : 127.0.0.1:41727_solr
   [junit4]   2> 415756 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:41727_solr
   [junit4]   2> 415756 INFO  (OverseerStateUpdate-73194814056759302-127.0.0.1:41727_solr-n_0000000000) [n:127.0.0.1:41727_solr     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
   [junit4]   2> 415758 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.p.PackageLoader /packages.json updated to version -1
   [junit4]   2> 415759 WARN  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_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> 415759 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.c.b.r.BackupRepositoryFactory Added backup repository with configuration params {type = repository,name = trackingBackupRepository,class = org.apache.solr.core.TrackingBackupRepository,attributes = {name=trackingBackupRepository, class=org.apache.solr.core.TrackingBackupRepository},args = {delegateRepoName=localfs}}
   [junit4]   2> 415759 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.c.b.r.BackupRepositoryFactory Added backup repository with configuration params {type = repository,name = localfs,class = org.apache.solr.core.backup.repository.LocalFileSystemRepository,attributes = {name=localfs, class=org.apache.solr.core.backup.repository.LocalFileSystemRepository},}
   [junit4]   2> 415771 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
   [junit4]   2> 415789 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 415795 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 415795 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 415796 INFO  (jetty-launcher-3112-thread-1) [n:127.0.0.1:41727_solr     ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node1
   [junit4]   2> 415904 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.CoreContainer Allowing use of paths: [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/my backup-001]
   [junit4]   2> 415905 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.h.c.HttpShardHandlerFactory Host whitelist initialized: WhitelistHostChecker [whitelistHosts=null, whitelistHostCheckingEnabled=true]
   [junit4]   2> 415906 WARN  (jetty-launcher-3112-thread-2) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@770f09cc[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 415906 WARN  (jetty-launcher-3112-thread-2) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@770f09cc[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 415909 WARN  (jetty-launcher-3112-thread-2) [     ] o.e.j.u.s.S.config Trusting all certificates configured for Client@67012d35[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 415909 WARN  (jetty-launcher-3112-thread-2) [     ] o.e.j.u.s.S.config No Client EndPointIdentificationAlgorithm configured for Client@67012d35[provider=null,keyStore=null,trustStore=null]
   [junit4]   2> 415910 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.ZkContainer Zookeeper client=127.0.0.1:39865/solr
   [junit4]   2> 415910 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 415911 INFO  (zkConnectionManagerCallback-3152-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 415912 INFO  (jetty-launcher-3112-thread-2) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 416014 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 416019 INFO  (zkConnectionManagerCallback-3154-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 416019 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 416030 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (1)
   [junit4]   2> 416041 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.c.ZkController Publish node=127.0.0.1:36637_solr as DOWN
   [junit4]   2> 416042 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores
   [junit4]   2> 416042 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.c.ZkController Register node as live in ZooKeeper:/live_nodes/127.0.0.1:36637_solr
   [junit4]   2> 416043 INFO  (zkCallback-3131-thread-1) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
   [junit4]   2> 416043 INFO  (zkCallback-3153-thread-1) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (1) -> (2)
   [junit4]   2> 416044 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.p.PackageLoader /packages.json updated to version -1
   [junit4]   2> 416044 WARN  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_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> 416044 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.c.b.r.BackupRepositoryFactory Added backup repository with configuration params {type = repository,name = trackingBackupRepository,class = org.apache.solr.core.TrackingBackupRepository,attributes = {name=trackingBackupRepository, class=org.apache.solr.core.TrackingBackupRepository},args = {delegateRepoName=localfs}}
   [junit4]   2> 416044 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.c.b.r.BackupRepositoryFactory Added backup repository with configuration params {type = repository,name = localfs,class = org.apache.solr.core.backup.repository.LocalFileSystemRepository,attributes = {name=localfs, class=org.apache.solr.core.backup.repository.LocalFileSystemRepository},}
   [junit4]   2> 416058 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.h.a.MetricsHistoryHandler No .system collection, keeping metrics history in memory.
   [junit4]   2> 416079 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 416089 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 416089 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 416091 INFO  (jetty-launcher-3112-thread-2) [n:127.0.0.1:36637_solr     ] o.a.s.c.CorePropertiesLocator Found 0 core definitions underneath /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node2
   [junit4]   2> 416106 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.MiniSolrCloudCluster waitForAllNodes: numServers=2
   [junit4]   2> 416107 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.c.ConnectionManager Waiting for client to connect to ZooKeeper
   [junit4]   2> 416109 INFO  (zkConnectionManagerCallback-3167-thread-1) [     ] o.a.s.c.c.ConnectionManager zkClient has connected
   [junit4]   2> 416109 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.c.ConnectionManager Client is connected to ZooKeeper
   [junit4]   2> 416110 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (0) -> (2)
   [junit4]   2> 416111 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [     ] o.a.s.c.s.i.ZkClientClusterStateProvider Cluster at 127.0.0.1:39865/solr ready
   [junit4]   2> 416133 INFO  (TEST-LocalFSCloudIncrementalBackupTest.testRestoreToOriginalCollection-seed#[91CAA748369D593]) [     ] o.a.s.SolrTestCaseJ4 ###Starting testRestoreToOriginalCollection
   [junit4]   2> 416138 INFO  (OverseerThreadFactory-3139-thread-1-processing-n:127.0.0.1:41727_solr) [n:127.0.0.1:41727_solr     ] o.a.s.c.a.c.CreateCollectionCmd Create collection backuprestore_testbackuprestoretooriginal
   [junit4]   2> 416244 INFO  (OverseerStateUpdate-73194814056759302-127.0.0.1:41727_solr-n_0000000000) [n:127.0.0.1:41727_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":"backuprestore_testbackuprestoretooriginal_shard1_replica_n1",
   [junit4]   2>   "node_name":"127.0.0.1:41727_solr",
   [junit4]   2>   "base_url":"http://127.0.0.1:41727/solr",
   [junit4]   2>   "collection":"backuprestore_testbackuprestoretooriginal",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 416246 INFO  (OverseerStateUpdate-73194814056759302-127.0.0.1:41727_solr-n_0000000000) [n:127.0.0.1:41727_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":"backuprestore_testbackuprestoretooriginal_shard1_replica_n2",
   [junit4]   2>   "node_name":"127.0.0.1:36637_solr",
   [junit4]   2>   "base_url":"http://127.0.0.1:36637/solr",
   [junit4]   2>   "collection":"backuprestore_testbackuprestoretooriginal",
   [junit4]   2>   "shard":"shard1",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 416248 INFO  (OverseerStateUpdate-73194814056759302-127.0.0.1:41727_solr-n_0000000000) [n:127.0.0.1:41727_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":"backuprestore_testbackuprestoretooriginal_shard2_replica_n4",
   [junit4]   2>   "node_name":"127.0.0.1:41727_solr",
   [junit4]   2>   "base_url":"http://127.0.0.1:41727/solr",
   [junit4]   2>   "collection":"backuprestore_testbackuprestoretooriginal",
   [junit4]   2>   "shard":"shard2",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 416251 INFO  (OverseerStateUpdate-73194814056759302-127.0.0.1:41727_solr-n_0000000000) [n:127.0.0.1:41727_solr     ] o.a.s.c.o.SliceMutator createReplica() {
   [junit4]   2>   "core":"backuprestore_testbackuprestoretooriginal_shard2_replica_n6",
   [junit4]   2>   "node_name":"127.0.0.1:36637_solr",
   [junit4]   2>   "base_url":"http://127.0.0.1:36637/solr",
   [junit4]   2>   "collection":"backuprestore_testbackuprestoretooriginal",
   [junit4]   2>   "shard":"shard2",
   [junit4]   2>   "state":"down",
   [junit4]   2>   "type":"NRT",
   [junit4]   2>   "operation":"ADDREPLICA",
   [junit4]   2>   "waitForFinalState":"false"} 
   [junit4]   2> 416455 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr    x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node5&collection.configName=conf1&newCollection=true&name=backuprestore_testbackuprestoretooriginal_shard1_replica_n2&action=CREATE&numShards=2&collection=backuprestore_testbackuprestoretooriginal&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 416455 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr    x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node7&collection.configName=conf1&newCollection=true&name=backuprestore_testbackuprestoretooriginal_shard2_replica_n4&action=CREATE&numShards=2&collection=backuprestore_testbackuprestoretooriginal&shard=shard2&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 416456 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr    x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 2147483647 transient cores
   [junit4]   2> 416456 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr    x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node8&collection.configName=conf1&newCollection=true&name=backuprestore_testbackuprestoretooriginal_shard2_replica_n6&action=CREATE&numShards=2&collection=backuprestore_testbackuprestoretooriginal&shard=shard2&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 416457 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr    x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.h.a.CoreAdminOperation core create command qt=/admin/cores&coreNodeName=core_node3&collection.configName=conf1&newCollection=true&name=backuprestore_testbackuprestoretooriginal_shard1_replica_n1&action=CREATE&numShards=2&collection=backuprestore_testbackuprestoretooriginal&shard=shard1&wt=javabin&version=2&replicaType=NRT
   [junit4]   2> 416472 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.9.0
   [junit4]   2> 416472 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.9.0
   [junit4]   2> 416485 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.9.0
   [junit4]   2> 416486 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.c.SolrConfig Using Lucene MatchVersion: 8.9.0
   [junit4]   2> 416488 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 416488 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 416488 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 416488 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.CoreContainer Creating SolrCore 'backuprestore_testbackuprestoretooriginal_shard2_replica_n6' using configuration from configset conf1, trusted=true
   [junit4]   2> 416488 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 416489 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.c.CoreContainer Creating SolrCore 'backuprestore_testbackuprestoretooriginal_shard1_replica_n1' using configuration from configset conf1, trusted=true
   [junit4]   2> 416489 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.backuprestore_testbackuprestoretooriginal.shard2.replica_n6' (registry 'solr.core.backuprestore_testbackuprestoretooriginal.shard2.replica_n6') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 416489 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.SolrCore [[backuprestore_testbackuprestoretooriginal_shard2_replica_n6] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node2/backuprestore_testbackuprestoretooriginal_shard2_replica_n6], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node2/backuprestore_testbackuprestoretooriginal_shard2_replica_n6/data/]
   [junit4]   2> 416491 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.backuprestore_testbackuprestoretooriginal.shard1.replica_n1' (registry 'solr.core.backuprestore_testbackuprestoretooriginal.shard1.replica_n1') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 416491 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 416492 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 416492 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.CoreContainer Creating SolrCore 'backuprestore_testbackuprestoretooriginal_shard1_replica_n2' using configuration from configset conf1, trusted=true
   [junit4]   2> 416492 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.backuprestore_testbackuprestoretooriginal.shard1.replica_n2' (registry 'solr.core.backuprestore_testbackuprestoretooriginal.shard1.replica_n2') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 416493 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.s.IndexSchema Schema name=minimal
   [junit4]   2> 416493 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.SolrCore [[backuprestore_testbackuprestoretooriginal_shard1_replica_n2] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node2/backuprestore_testbackuprestoretooriginal_shard1_replica_n2], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node2/backuprestore_testbackuprestoretooriginal_shard1_replica_n2/data/]
   [junit4]   2> 416493 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.s.IndexSchema Loaded schema minimal/1.1 with uniqueid field id
   [junit4]   2> 416493 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.c.CoreContainer Creating SolrCore 'backuprestore_testbackuprestoretooriginal_shard2_replica_n4' using configuration from configset conf1, trusted=true
   [junit4]   2> 416494 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.backuprestore_testbackuprestoretooriginal.shard2.replica_n4' (registry 'solr.core.backuprestore_testbackuprestoretooriginal.shard2.replica_n4') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@5f6a3f13
   [junit4]   2> 416494 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.c.SolrCore [[backuprestore_testbackuprestoretooriginal_shard2_replica_n4] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node1/backuprestore_testbackuprestoretooriginal_shard2_replica_n4], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node1/backuprestore_testbackuprestoretooriginal_shard2_replica_n4/data/]
   [junit4]   2> 416497 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.c.SolrCore [[backuprestore_testbackuprestoretooriginal_shard1_replica_n1] ] Opening new SolrCore at [/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node1/backuprestore_testbackuprestoretooriginal_shard1_replica_n1], dataDir=[/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/tempDir-001/node1/backuprestore_testbackuprestoretooriginal_shard1_replica_n1/data/]
   [junit4]   2> 416557 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 416557 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 416558 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 416558 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 416563 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf1
   [junit4]   2> 416563 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf1
   [junit4]   2> 416564 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 416564 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1694820259916152832
   [junit4]   2> 416567 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 416567 INFO  (searcherExecutor-3169-thread-1-processing-n:127.0.0.1:36637_solr x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.SolrCore [backuprestore_testbackuprestoretooriginal_shard2_replica_n6]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 416567 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 416568 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 416568 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 416572 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf1
   [junit4]   2> 416573 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf1
   [junit4]   2> 416574 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 416574 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1694820259926638592
   [junit4]   2> 416574 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 416574 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 416575 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 416575 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 416576 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.u.UpdateHandler Using UpdateLog implementation: org.apache.solr.update.UpdateLog
   [junit4]   2> 416576 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.u.UpdateLog Initializing UpdateLog: dataDir=null defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=65536
   [junit4]   2> 416577 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 416577 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 416579 INFO  (searcherExecutor-3175-thread-1-processing-n:127.0.0.1:41727_solr x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.c.SolrCore [backuprestore_testbackuprestoretooriginal_shard2_replica_n4]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 416581 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf1
   [junit4]   2> 416581 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Configured ZooKeeperStorageIO with znodeBase: /configs/conf1
   [junit4]   2> 416581 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/backuprestore_testbackuprestoretooriginal/terms/shard2 to Terms{values={core_node8=0}, version=0}
   [junit4]   2> 416581 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/backuprestore_testbackuprestoretooriginal/leaders/shard2
   [junit4]   2> 416581 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf1
   [junit4]   2> 416581 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.r.ManagedResourceStorage Loaded null at path _rest_managed.json using ZooKeeperStorageIO:path=/configs/conf1
   [junit4]   2> 416582 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 416582 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1694820259935027200
   [junit4]   2> 416582 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.h.ReplicationHandler Commits will be reserved for 10000 ms
   [junit4]   2> 416582 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.u.UpdateLog Could not find max version in index or recent updates, using new clock 1694820259935027200
   [junit4]   2> 416586 INFO  (searcherExecutor-3173-thread-1-processing-n:127.0.0.1:36637_solr x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.SolrCore [backuprestore_testbackuprestoretooriginal_shard1_replica_n2]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 416587 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/backuprestore_testbackuprestoretooriginal/terms/shard2 to Terms{values={core_node7=0, core_node8=0}, version=1}
   [junit4]   2> 416587 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/backuprestore_testbackuprestoretooriginal/leaders/shard2
   [junit4]   2> 416587 INFO  (searcherExecutor-3171-thread-1-processing-n:127.0.0.1:41727_solr x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.c.SolrCore [backuprestore_testbackuprestoretooriginal_shard1_replica_n1]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 416589 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 416589 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/backuprestore_testbackuprestoretooriginal/terms/shard1 to Terms{values={core_node5=0}, version=0}
   [junit4]   2> 416589 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/backuprestore_testbackuprestoretooriginal/leaders/shard1
   [junit4]   2> 416589 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 416590 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.SyncStrategy Sync replicas to http://127.0.0.1:36637/solr/backuprestore_testbackuprestoretooriginal_shard2_replica_n6/
   [junit4]   2> 416590 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/backuprestore_testbackuprestoretooriginal/terms/shard1 to Terms{values={core_node3=0, core_node5=0}, version=1}
   [junit4]   2> 416590 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.c.ShardLeaderElectionContextBase make sure parent is created /collections/backuprestore_testbackuprestoretooriginal/leaders/shard1
   [junit4]   2> 416591 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.u.PeerSync PeerSync: core=backuprestore_testbackuprestoretooriginal_shard2_replica_n6 url=http://127.0.0.1:36637/solr  START replicas=[http://127.0.0.1:41727/solr/backuprestore_testbackuprestoretooriginal_shard2_replica_n4/] nUpdates=100
   [junit4]   2> 416591 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.u.PeerSync PeerSync: core=backuprestore_testbackuprestoretooriginal_shard2_replica_n6 url=http://127.0.0.1:36637/solr  DONE. We have no versions. sync failed.
   [junit4]   2> 416593 INFO  (qtp1683920754-6095) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.c.S.Request [backuprestore_testbackuprestoretooriginal_shard2_replica_n4]  webapp=/solr path=/get params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2} status=0 QTime=0
   [junit4]   2> 416594 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.SyncStrategy Leader's attempt to sync with shard failed, moving to the next candidate
   [junit4]   2> 416594 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.ShardLeaderElectionContext We failed sync, but we have no versions - we can't sync in that case - we were active before, so become leader anyway
   [junit4]   2> 416594 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node /collections/backuprestore_testbackuprestoretooriginal/leaders/shard2/leader after winning as /collections/backuprestore_testbackuprestoretooriginal/leader_elect/shard2/election/73194814056759304-core_node8-n_0000000000
   [junit4]   2> 416596 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.ShardLeaderElectionContext Enough replicas found to continue.
   [junit4]   2> 416596 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.ShardLeaderElectionContext I may be the new leader - try and sync
   [junit4]   2> 416596 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.SyncStrategy Sync replicas to http://127.0.0.1:36637/solr/backuprestore_testbackuprestoretooriginal_shard1_replica_n2/
   [junit4]   2> 416596 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.ShardLeaderElectionContext I am the new leader: http://127.0.0.1:36637/solr/backuprestore_testbackuprestoretooriginal_shard2_replica_n6/ shard2
   [junit4]   2> 416597 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.u.PeerSync PeerSync: core=backuprestore_testbackuprestoretooriginal_shard1_replica_n2 url=http://127.0.0.1:36637/solr  START replicas=[http://127.0.0.1:41727/solr/backuprestore_testbackuprestoretooriginal_shard1_replica_n1/] nUpdates=100
   [junit4]   2> 416597 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.u.PeerSync PeerSync: core=backuprestore_testbackuprestoretooriginal_shard1_replica_n2 url=http://127.0.0.1:36637/solr  DONE. We have no versions. sync failed.
   [junit4]   2> 416598 INFO  (qtp1683920754-6092) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.c.S.Request [backuprestore_testbackuprestoretooriginal_shard1_replica_n1]  webapp=/solr path=/get params={distrib=false&qt=/get&fingerprint=false&getVersions=100&wt=javabin&version=2} status=0 QTime=0
   [junit4]   2> 416598 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.SyncStrategy Leader's attempt to sync with shard failed, moving to the next candidate
   [junit4]   2> 416598 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.ShardLeaderElectionContext We failed sync, but we have no versions - we can't sync in that case - we were active before, so become leader anyway
   [junit4]   2> 416598 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.ShardLeaderElectionContextBase Creating leader registration node /collections/backuprestore_testbackuprestoretooriginal/leaders/shard1/leader after winning as /collections/backuprestore_testbackuprestoretooriginal/leader_elect/shard1/election/73194814056759304-core_node5-n_0000000000
   [junit4]   2> 416599 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.ShardLeaderElectionContext I am the new leader: http://127.0.0.1:36637/solr/backuprestore_testbackuprestoretooriginal_shard1_replica_n2/ shard1
   [junit4]   2> 416701 INFO  (zkCallback-3153-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 416704 INFO  (zkCallback-3153-thread-2) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 416704 INFO  (zkCallback-3153-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 416704 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.ZkController I am the leader, no recovery necessary
   [junit4]   2> 416705 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.ZkController I am the leader, no recovery necessary
   [junit4]   2> 416710 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node8&collection.configName=conf1&newCollection=true&name=backuprestore_testbackuprestoretooriginal_shard2_replica_n6&action=CREATE&numShards=2&collection=backuprestore_testbackuprestoretooriginal&shard=shard2&wt=javabin&version=2&replicaType=NRT} status=0 QTime=254
   [junit4]   2> 416711 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node5&collection.configName=conf1&newCollection=true&name=backuprestore_testbackuprestoretooriginal_shard1_replica_n2&action=CREATE&numShards=2&collection=backuprestore_testbackuprestoretooriginal&shard=shard1&wt=javabin&version=2&replicaType=NRT} status=0 QTime=256
   [junit4]   2> 416809 INFO  (zkCallback-3153-thread-2) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 416809 INFO  (zkCallback-3153-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 416809 INFO  (zkCallback-3153-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 416809 INFO  (zkCallback-3153-thread-4) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 417597 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node7&collection.configName=conf1&newCollection=true&name=backuprestore_testbackuprestoretooriginal_shard2_replica_n4&action=CREATE&numShards=2&collection=backuprestore_testbackuprestoretooriginal&shard=shard2&wt=javabin&version=2&replicaType=NRT} status=0 QTime=1141
   [junit4]   2> 417598 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={qt=/admin/cores&coreNodeName=core_node3&collection.configName=conf1&newCollection=true&name=backuprestore_testbackuprestoretooriginal_shard1_replica_n1&action=CREATE&numShards=2&collection=backuprestore_testbackuprestoretooriginal&shard=shard1&wt=javabin&version=2&replicaType=NRT} status=0 QTime=1141
   [junit4]   2> 417600 INFO  (qtp1683920754-6090) [n:127.0.0.1:41727_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> 417700 INFO  (zkCallback-3153-thread-2) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 417700 INFO  (zkCallback-3153-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 417700 INFO  (zkCallback-3131-thread-2) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 417700 INFO  (zkCallback-3153-thread-4) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 417700 INFO  (zkCallback-3153-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 417700 INFO  (zkCallback-3131-thread-1) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 417700 INFO  (zkCallback-3131-thread-3) [     ] o.a.s.c.c.ZkStateReader A cluster state change: [WatchedEvent state:SyncConnected type:NodeDataChanged path:/collections/backuprestore_testbackuprestoretooriginal/state.json] for collection [backuprestore_testbackuprestoretooriginal] has occurred - updating... (live nodes size: [2])
   [junit4]   2> 417700 INFO  (qtp1683920754-6090) [n:127.0.0.1:41727_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections params={collection.configName=conf1&maxShardsPerNode=-1&name=backuprestore_testbackuprestoretooriginal&nrtReplicas=2&action=CREATE&numShards=2&wt=javabin&version=2} status=0 QTime=1565
   [junit4]   2> 417717 INFO  (qtp2064197574-6098) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/backuprestore_testbackuprestoretooriginal/terms/shard2 to Terms{values={core_node7=1, core_node8=1}, version=2}
   [junit4]   2> 417717 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.ZkShardTerms Successful update of terms at /collections/backuprestore_testbackuprestoretooriginal/terms/shard1 to Terms{values={core_node3=1, core_node5=1}, version=2}
   [junit4]   2> 417720 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.u.p.LogUpdateProcessorFactory [backuprestore_testbackuprestoretooriginal_shard2_replica_n4]  webapp=/solr path=/update params={update.distrib=FROMLEADER&distrib.from=http://127.0.0.1:36637/solr/backuprestore_testbackuprestoretooriginal_shard2_replica_n6/&wt=javabin&version=2}{add=[2a25f6b4-7fd2-400f-935e-cb6a8d102cdc (1694820261113626624), 9c0f6a05-18ce-4737-aec1-0643d290003a (1694820261116772352), dfda8c91-50a8-4471-a11d-c19d92ef7132 (1694820261116772353), 327591e3-6a86-416e-b9a2-d10021c8a046 (1694820261116772354), cf33fd54-5d30-4058-88ef-1ff0ecae99f1 (1694820261116772355), e886a338-c8e1-41b9-b0c7-7e2667acf112 (1694820261116772356), 3cff3681-0294-448c-b281-f9c079918f23 (1694820261116772357), fc63cda0-f72f-40c9-84fd-3dc82af4d7b5 (1694820261116772358), a087bf5f-5bed-40bb-9a1d-d9685643d2a3 (1694820261116772359), 5a291813-9d4e-4afa-8e5b-ad559d3588a7 (1694820261116772360), ... (42 adds)]} 0 6
   [junit4]   2> 417722 INFO  (qtp1683920754-6088) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.u.p.LogUpdateProcessorFactory [backuprestore_testbackuprestoretooriginal_shard1_replica_n1]  webapp=/solr path=/update params={update.distrib=FROMLEADER&distrib.from=http://127.0.0.1:36637/solr/backuprestore_testbackuprestoretooriginal_shard1_replica_n2/&wt=javabin&version=2}{add=[d643c3cc-e93d-4253-a16d-1c246911a322 (1694820261113626624), 8e735895-dd69-4530-8ac4-ea20f5803039 (1694820261116772352), d72e0505-ad0a-4450-a1cc-7d56359b295f (1694820261116772353), 0a65428c-af6c-4015-88d9-fff48853cc1b (1694820261116772354), 92dc4b44-3a1e-4682-988f-d2951b074ead (1694820261116772355), f33ba5cb-224f-48c6-8081-c6abd05822a4 (1694820261116772356), 16c803a8-08be-4139-a259-1fb5ffcfe1e7 (1694820261116772357), 9ca870b4-7230-49f0-83d8-0a4f8d2550f1 (1694820261118869504), 777ef7b8-0a19-4932-aad6-a40cfa6fd726 (1694820261118869505), 1ec4b587-39ef-497e-b7d2-c0f373d19d29 (1694820261118869506), ... (42 adds)]} 0 6
   [junit4]   2> 417723 INFO  (qtp2064197574-6098) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.u.p.LogUpdateProcessorFactory [backuprestore_testbackuprestoretooriginal_shard2_replica_n6]  webapp=/solr path=/update params={wt=javabin&version=2}{add=[2a25f6b4-7fd2-400f-935e-cb6a8d102cdc (1694820261113626624), 9c0f6a05-18ce-4737-aec1-0643d290003a (1694820261116772352), dfda8c91-50a8-4471-a11d-c19d92ef7132 (1694820261116772353), 327591e3-6a86-416e-b9a2-d10021c8a046 (1694820261116772354), cf33fd54-5d30-4058-88ef-1ff0ecae99f1 (1694820261116772355), e886a338-c8e1-41b9-b0c7-7e2667acf112 (1694820261116772356), 3cff3681-0294-448c-b281-f9c079918f23 (1694820261116772357), fc63cda0-f72f-40c9-84fd-3dc82af4d7b5 (1694820261116772358), a087bf5f-5bed-40bb-9a1d-d9685643d2a3 (1694820261116772359), 5a291813-9d4e-4afa-8e5b-ad559d3588a7 (1694820261116772360), ... (42 adds)]} 0 17
   [junit4]   2> 417723 INFO  (qtp2064197574-6100) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.u.p.LogUpdateProcessorFactory [backuprestore_testbackuprestoretooriginal_shard1_replica_n2]  webapp=/solr path=/update params={wt=javabin&version=2}{add=[d643c3cc-e93d-4253-a16d-1c246911a322 (1694820261113626624), 8e735895-dd69-4530-8ac4-ea20f5803039 (1694820261116772352), d72e0505-ad0a-4450-a1cc-7d56359b295f (1694820261116772353), 0a65428c-af6c-4015-88d9-fff48853cc1b (1694820261116772354), 92dc4b44-3a1e-4682-988f-d2951b074ead (1694820261116772355), f33ba5cb-224f-48c6-8081-c6abd05822a4 (1694820261116772356), 16c803a8-08be-4139-a259-1fb5ffcfe1e7 (1694820261116772357), 9ca870b4-7230-49f0-83d8-0a4f8d2550f1 (1694820261118869504), 777ef7b8-0a19-4932-aad6-a40cfa6fd726 (1694820261118869505), 1ec4b587-39ef-497e-b7d2-c0f373d19d29 (1694820261118869506), ... (42 adds)]} 0 17
   [junit4]   2> 418008 INFO  (searcherExecutor-3169-thread-1-processing-n:127.0.0.1:36637_solr x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.c.SolrCore [backuprestore_testbackuprestoretooriginal_shard2_replica_n6]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 418008 INFO  (searcherExecutor-3175-thread-1-processing-n:127.0.0.1:41727_solr x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.c.SolrCore [backuprestore_testbackuprestoretooriginal_shard2_replica_n4]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 418009 INFO  (qtp1683920754-6090) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node7 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n4 ] o.a.s.u.p.LogUpdateProcessorFactory [backuprestore_testbackuprestoretooriginal_shard2_replica_n4]  webapp=/solr path=/update params={update.distrib=FROMLEADER&waitSearcher=true&openSearcher=true&commit=true&softCommit=false&distrib.from=http://127.0.0.1:36637/solr/backuprestore_testbackuprestoretooriginal_shard2_replica_n6/&commit_end_point=replicas&wt=javabin&version=2&expungeDeletes=false}{commit=} 0 279
   [junit4]   2> 418010 INFO  (qtp2064197574-6098) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard2 r:core_node8 x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.u.p.LogUpdateProcessorFactory [backuprestore_testbackuprestoretooriginal_shard2_replica_n6]  webapp=/solr path=/update params={update.distrib=TOLEADER&waitSearcher=true&openSearcher=true&commit=true&softCommit=false&distrib.from=http://127.0.0.1:36637/solr/backuprestore_testbackuprestoretooriginal_shard1_replica_n2/&commit_end_point=leaders&wt=javabin&version=2&expungeDeletes=false}{commit=} 0 282
   [junit4]   2> 418145 INFO  (OverseerCollectionConfigSetProcessor-73194814056759302-127.0.0.1:41727_solr-n_0000000000) [n:127.0.0.1:41727_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> 418281 INFO  (searcherExecutor-3173-thread-1-processing-n:127.0.0.1:36637_solr x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.c.SolrCore [backuprestore_testbackuprestoretooriginal_shard1_replica_n2]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 418281 INFO  (searcherExecutor-3171-thread-1-processing-n:127.0.0.1:41727_solr x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.c.SolrCore [backuprestore_testbackuprestoretooriginal_shard1_replica_n1]  Registered new searcher autowarm time: 0 ms
   [junit4]   2> 418282 INFO  (qtp1683920754-6095) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node3 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n1 ] o.a.s.u.p.LogUpdateProcessorFactory [backuprestore_testbackuprestoretooriginal_shard1_replica_n1]  webapp=/solr path=/update params={update.distrib=FROMLEADER&waitSearcher=true&openSearcher=true&commit=true&softCommit=false&distrib.from=http://127.0.0.1:36637/solr/backuprestore_testbackuprestoretooriginal_shard1_replica_n2/&commit_end_point=replicas&wt=javabin&version=2&expungeDeletes=false}{commit=} 0 269
   [junit4]   2> 418282 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr c:backuprestore_testbackuprestoretooriginal s:shard1 r:core_node5 x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.u.p.LogUpdateProcessorFactory [backuprestore_testbackuprestoretooriginal_shard1_replica_n2]  webapp=/solr path=/update params={_stateVer_=backuprestore_testbackuprestoretooriginal:5&waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=} 0 558
   [junit4]   2> 418283 INFO  (TEST-LocalFSCloudIncrementalBackupTest.testRestoreToOriginalCollection-seed#[91CAA748369D593]) [     ] o.a.s.c.a.c.AbstractIncrementalBackupTest Indexed 84 docs to collection: backuprestore_testbackuprestoretooriginal
   [junit4]   2> 418292 INFO  (qtp1683920754-6092) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal    ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections params={async=3997af17-340c-445e-a665-82bb68896b09&name=mytestbackuptestbackuprestoretooriginal&action=BACKUP&location=/home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/my+backup-001&collection=backuprestore_testbackuprestoretooriginal&incremental=true&repository=trackingBackupRepository&wt=javabin&version=2} status=0 QTime=5
   [junit4]   2> 418298 INFO  (qtp1683920754-6094) [n:127.0.0.1:41727_solr     ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/collections params={requestid=3997af17-340c-445e-a665-82bb68896b09&action=REQUESTSTATUS&wt=javabin&version=2} status=0 QTime=5
   [junit4]   2> 418314 INFO  (OverseerThreadFactory-3139-thread-2-processing-n:127.0.0.1:41727_solr) [n:127.0.0.1:41727_solr c:backuprestore_testbackuprestoretooriginal    ] o.a.s.c.a.c.BackupCmd Starting backup of collection=backuprestore_testbackuprestoretooriginal with backupName=mytestbackuptestbackuprestoretooriginal at location=file:///home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/my%20backup-001/mytestbackuptestbackuprestoretooriginal/backuprestore_testbackuprestoretooriginal
   [junit4]   2> 418320 INFO  (qtp2064197574-6098) [n:127.0.0.1:36637_solr    x:backuprestore_testbackuprestoretooriginal_shard1_replica_n2 ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={core=backuprestore_testbackuprestoretooriginal_shard1_replica_n2&async=3997af17-340c-445e-a665-82bb68896b0917352603902347544&qt=/admin/cores&name=shard1&shardBackupId=md_shard1_0&action=BACKUPCORE&location=file:///home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/my%2520backup-001/mytestbackuptestbackuprestoretooriginal/backuprestore_testbackuprestoretooriginal&incremental=true&repository=trackingBackupRepository&wt=javabin&version=2} status=0 QTime=0
   [junit4]   2> 418320 INFO  (qtp2064197574-6096) [n:127.0.0.1:36637_solr    x:backuprestore_testbackuprestoretooriginal_shard2_replica_n6 ] o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores params={core=backuprestore_testbackuprestoretooriginal_shard2_replica_n6&async=3997af17-340c-445e-a665-82bb68896b0917352603902271347&qt=/admin/cores&name=shard2&shardBackupId=md_shard2_0&action=BACKUPCORE&location=file:///home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001/my%2520backup-001/mytestbackuptestbackuprestoretooriginal/backuprestore_testbackuprestoretooriginal&incremental=true&repository=trackingBackupRepository&wt=javabin&version=2} status=0 QTime=0
   [junit4]   2> 418322 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr     ] o.a.s.h.a.CoreAdminOperation Checking request status for : 3997af17-340c-445e-a665-82bb68896b0917352603902271347
   [junit4]   2> 418322 INFO  (qtp2064197574-6099) [n:127.0.0.1:36637_solr     ] o.a.s.s

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

.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty tag=null
   [junit4]   2> 465566 INFO  (jetty-closer-3408-thread-1-processing-n:127.0.0.1:36637_solr) [     ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@3d8cf309: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty/com.codahale.metrics.MetricRegistry@3d183c57
   [junit4]   2> 465566 INFO  (jetty-closer-3408-thread-1-processing-n:127.0.0.1:36637_solr) [     ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.cluster tag=null
   [junit4]   2> 465566 INFO  (closeThreadPool-3419-thread-2) [     ] o.a.s.c.Overseer Overseer (id=73194814056759302-127.0.0.1:41727_solr-n_0000000000) closing
   [junit4]   2> 465567 INFO  (OverseerStateUpdate-73194814056759302-127.0.0.1:41727_solr-n_0000000000) [n:127.0.0.1:41727_solr     ] o.a.s.c.Overseer Overseer Loop exiting : 127.0.0.1:41727_solr
   [junit4]   2> 465568 INFO  (jetty-closer-3408-thread-2-processing-n:127.0.0.1:36637_solr) [     ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.jetty tag=null
   [junit4]   2> 465568 INFO  (jetty-closer-3408-thread-2-processing-n:127.0.0.1:36637_solr) [     ] o.a.s.m.r.SolrJmxReporter Closing reporter [org.apache.solr.metrics.reporters.SolrJmxReporter@7a3efa07: rootName = null, domain = solr.jetty, service url = null, agent id = null] for registry solr.jetty/com.codahale.metrics.MetricRegistry@3d183c57
   [junit4]   2> 465568 INFO  (jetty-closer-3408-thread-2-processing-n:127.0.0.1:36637_solr) [     ] o.a.s.m.SolrMetricManager Closing metric reporters for registry=solr.cluster tag=null
   [junit4]   2> 465572 INFO  (OverseerAutoScalingTriggerThread-73194814056759302-127.0.0.1:41727_solr-n_0000000000) [     ] o.a.s.c.a.OverseerTriggerThread OverseerTriggerThread woken up but we are closed, exiting.
   [junit4]   2> 465574 INFO  (closeThreadPool-3419-thread-1) [     ] o.a.s.c.Overseer Overseer (id=73194814056759302-127.0.0.1:41727_solr-n_0000000000) closing
   [junit4]   2> 465576 WARN  (jetty-launcher-3112-thread-1-SendThread(127.0.0.1:39865)) [     ] o.a.z.ClientCnxn An exception was thrown while closing send thread for session 0x1040a4bab410006.
   [junit4]   2>           => EndOfStreamException: Unable to read additional data from server sessionid 0x1040a4bab410006, 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 0x1040a4bab410006, 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> 465576 INFO  (zkCallback-3153-thread-3) [     ] o.a.s.c.c.ZkStateReader Updated live nodes from ZooKeeper... (2) -> (1)
   [junit4]   2> 465676 INFO  (jetty-closer-3408-thread-1-processing-n:127.0.0.1:36637_solr) [     ] o.a.s.c.Overseer Overseer (id=73194814056759302-127.0.0.1:41727_solr-n_0000000000) closing
   [junit4]   2> 465677 INFO  (jetty-closer-3408-thread-1-processing-n:127.0.0.1:36637_solr) [     ] o.e.j.s.AbstractConnector Stopped ServerConnector@6a996589{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:0}
   [junit4]   2> 465677 INFO  (jetty-closer-3408-thread-1-processing-n:127.0.0.1:36637_solr) [     ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@7ecdf6c5{/solr,null,STOPPED}
   [junit4]   2> 465677 INFO  (jetty-closer-3408-thread-1-processing-n:127.0.0.1:36637_solr) [     ] o.e.j.s.session node0 Stopped scavenging
   [junit4]   2> 465777 INFO  (jetty-closer-3408-thread-2-processing-n:127.0.0.1:36637_solr) [     ] o.e.j.s.AbstractConnector Stopped ServerConnector@75ced6d7{HTTP/1.1, (http/1.1, h2c)}{127.0.0.1:0}
   [junit4]   2> 465778 INFO  (jetty-closer-3408-thread-2-processing-n:127.0.0.1:36637_solr) [     ] o.e.j.s.h.ContextHandler Stopped o.e.j.s.ServletContextHandler@235db78c{/solr,null,STOPPED}
   [junit4]   2> 465778 INFO  (jetty-closer-3408-thread-2-processing-n:127.0.0.1:36637_solr) [     ] o.e.j.s.session node0 Stopped scavenging
   [junit4]   2> 465778 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [n:127.0.0.1:36637_solr     ] o.a.s.c.ZkTestServer Shutting down ZkTestServer.
   [junit4]   2> 465981 WARN  (ZkTestServer Run Thread) [     ] o.a.s.c.ZkTestServer Watch limit violations: 
   [junit4]   2> Maximum concurrent create/delete watches above limit:
   [junit4]   2> 
   [junit4]   2> 	21	/solr/collections/backuprestore_testbackupinc_restored/state.json
   [junit4]   2> 	20	/solr/collections/backuprestore_testbackupinc_restored/terms/shard1
   [junit4]   2> 	19	/solr/collections/backuprestore_testbackupinc_restored/terms/shard2
   [junit4]   2> 	7	/solr/collections/backuprestore_testbackuprestoretooriginal/terms/shard2
   [junit4]   2> 	7	/solr/collections/backuprestore_testbackuprestoretooriginal/terms/shard1
   [junit4]   2> 	7	/solr/collections/backuprestore_testbackupinc/terms/shard2
   [junit4]   2> 	7	/solr/collections/backuprestore_testbackupinc/terms/shard1
   [junit4]   2> 	3	/solr/collections/backuprestore_testbackupincsimple_restore/terms/shard2
   [junit4]   2> 	3	/solr/aliases.json
   [junit4]   2> 	3	/solr/collections/backuprestore_testbackupincsimple_restore/terms/shard1
   [junit4]   2> 	3	/solr/collections/backuprestore_testbackupincsimple/terms/shard2
   [junit4]   2> 	3	/solr/collections/backuprestore_testbackupincsimple/terms/shard1
   [junit4]   2> 	3	/solr/clusterprops.json
   [junit4]   2> 	2	/solr/packages.json
   [junit4]   2> 	2	/solr/security.json
   [junit4]   2> 	2	/solr/collections/backuprestore_testbackupincsimple/collectionprops.json
   [junit4]   2> 	2	/solr/configs/conf1
   [junit4]   2> 	2	/solr/collections/backuprestore_testbackuprestoretooriginal/collectionprops.json
   [junit4]   2> 	2	/solr/collections/backuprestore_testbackupinc/collectionprops.json
   [junit4]   2> 
   [junit4]   2> Maximum concurrent data watches above limit:
   [junit4]   2> 
   [junit4]   2> 	76	/solr/collections/backuprestore_testbackupinc_restored/state.json
   [junit4]   2> 	52	/solr/collections/backuprestore_testbackupincsimple_restore/state.json
   [junit4]   2> 	46	/solr/collections/backuprestore_testbackuprestoretooriginal/state.json
   [junit4]   2> 	32	/solr/collections/backuprestore_testbackupinc/state.json
   [junit4]   2> 	24	/solr/collections/backuprestore_testbackupincsimple/state.json
   [junit4]   2> 	3	/solr/clusterstate.json
   [junit4]   2> 
   [junit4]   2> Maximum concurrent children watches above limit:
   [junit4]   2> 
   [junit4]   2> 	155	/solr/overseer/queue
   [junit4]   2> 	79	/solr/overseer/collection-queue-work
   [junit4]   2> 	28	/solr/collections/backuprestore_testbackupinc_restored/state.json
   [junit4]   2> 	27	/solr/collections
   [junit4]   2> 	11	/solr/collections/backuprestore_testbackuprestoretooriginal/state.json
   [junit4]   2> 	10	/solr/collections/backuprestore_testbackupinc/state.json
   [junit4]   2> 	8	/solr/collections/backuprestore_testbackupincsimple/state.json
   [junit4]   2> 	8	/solr/collections/backuprestore_testbackupincsimple_restore/state.json
   [junit4]   2> 	7	/solr/live_nodes
   [junit4]   2> 
   [junit4]   2> 465984 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [n:127.0.0.1:36637_solr     ] o.a.s.c.ZkTestServer waitForServerDown: 127.0.0.1:39865
   [junit4]   2> 465985 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [n:127.0.0.1:36637_solr     ] o.a.s.c.ZkTestServer parse host and port list: 127.0.0.1:39865
   [junit4]   2> 465985 INFO  (SUITE-LocalFSCloudIncrementalBackupTest-seed#[91CAA748369D593]-worker) [n:127.0.0.1:36637_solr     ] o.a.s.c.ZkTestServer connecting to 127.0.0.1 39865
   [junit4]   2> NOTE: leaving temporary files on disk at: /home/jenkins/jenkins-slave/workspace/Lucene/Lucene-Solr-Tests-8.x/solr/build/solr-core/test/J0/temp/solr.cloud.api.collections.LocalFSCloudIncrementalBackupTest_91CAA748369D593-001
   [junit4]   2> Mar 21, 2021 6:03:22 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): {shard_s=PostingsFormat(name=LuceneVarGapDocFreqInterval), _root_=Lucene84, id=BlockTreeOrds(blocksize=128)}, docValues:{_version_=DocValuesFormat(name=Direct)}, maxPointsInLeafNode=634, maxMBSortInHeap=5.160598762082958, sim=Asserting(RandomSimilarity(queryNorm=true): {}), locale=sq, timezone=Atlantic/Azores
   [junit4]   2> NOTE: Linux 4.15.0-112-generic amd64/Oracle Corporation 1.8.0_281 (64-bit)/cpus=4,threads=1,free=238045472,total=523763712
   [junit4]   2> NOTE: All tests run in this JVM: [OpenExchangeRatesOrgProviderTest, UnloadDistributedZkTest, TestCloudConsistency, IndexSizeTriggerTest, SimpleMLTQParserTest, TestManagedSchemaAPI, ClusterStateMockUtilTest, TestBinaryField, TestConfigSets, AnalyticsMergeStrategyTest, MetricsHistoryIntegrationTest, TestRTimerTree, PreAnalyzedUpdateProcessorTest, TestSimpleTrackingShardHandler, TestStressInPlaceUpdates, DocumentAnalysisRequestHandlerTest, DisMaxRequestHandlerTest, FullSolrCloudDistribCmdsTest, TestSimpleTextCodec, TestDistribIDF, DistributedQueryComponentCustomSortTest, OverriddenZkACLAndCredentialsProvidersTest, TestPostingsSolrHighlighter, ZkStateReaderTest, HdfsDirectoryFactoryTest, HdfsSyncSliceTest, LocalFSCloudIncrementalBackupTest]
   [junit4] Completed [174/934 (1!)] on J0 in 51.77s, 3 tests, 1 error <<< FAILURES!

[...truncated 53444 lines...]