Build: https://jenkins.thetaphi.de/job/Lucene-Solr-7.x-MacOSX/371/
Java: 64bit/jdk1.8.0 -XX:+UseCompressedOops -XX:+UseConcMarkSweepGC

1 tests failed.
FAILED:  
org.apache.solr.handler.TestReplicationHandler.doTestIndexAndConfigReplication

Error Message:
Index: 0, Size: 0

Stack Trace:
java.lang.IndexOutOfBoundsException: Index: 0, Size: 0
        at 
__randomizedtesting.SeedInfo.seed([30FAE5EFDBC7B0AE:24B2BEBAF8C00DB0]:0)
        at java.util.ArrayList.rangeCheck(ArrayList.java:653)
        at java.util.ArrayList.get(ArrayList.java:429)
        at 
org.apache.solr.handler.TestReplicationHandler.doTestIndexAndConfigReplication(TestReplicationHandler.java:561)
        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:1737)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:934)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:970)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:984)
        at 
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
        at 
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
        at 
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
        at 
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:943)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
        at 
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:53)
        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
        at 
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
        at java.lang.Thread.run(Thread.java:748)




Build Log:
[...truncated 12204 lines...]
   [junit4] Suite: org.apache.solr.handler.TestReplicationHandler
   [junit4]   2> 787974 INFO  
(SUITE-TestReplicationHandler-seed#[30FAE5EFDBC7B0AE]-worker) [    ] 
o.a.s.SolrTestCaseJ4 SecureRandom sanity checks: 
test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
   [junit4]   2> Creating dataDir: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/init-core-data-001
   [junit4]   2> 787975 WARN  
(SUITE-TestReplicationHandler-seed#[30FAE5EFDBC7B0AE]-worker) [    ] 
o.a.s.SolrTestCaseJ4 startTrackingSearchers: numOpens=1 numCloses=1
   [junit4]   2> 787975 INFO  
(SUITE-TestReplicationHandler-seed#[30FAE5EFDBC7B0AE]-worker) [    ] 
o.a.s.SolrTestCaseJ4 Using PointFields (NUMERIC_POINTS_SYSPROP=true) 
w/NUMERIC_DOCVALUES_SYSPROP=true
   [junit4]   2> 787978 INFO  
(SUITE-TestReplicationHandler-seed#[30FAE5EFDBC7B0AE]-worker) [    ] 
o.a.s.SolrTestCaseJ4 Randomized ssl (false) and clientAuth (false) via: 
@org.apache.solr.SolrTestCaseJ4$SuppressSSL(bugUrl=None) w/ MAC_OS_X supressed 
clientAuth
   [junit4]   2> 787979 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.SolrTestCaseJ4 ###Starting doTestReplicateAfterCoreReload
   [junit4]   2> 787979 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.SolrTestCaseJ4 Writing core.properties file to 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/collection1
   [junit4]   2> 787988 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.Server jetty-9.3.20.v20170531
   [junit4]   2> 787989 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@6cf84efe{/solr,null,AVAILABLE}
   [junit4]   2> 787991 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.AbstractConnector Started 
ServerConnector@29ba962d{HTTP/1.1,[http/1.1]}{127.0.0.1:56616}
   [junit4]   2> 787991 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.Server Started @791244ms
   [junit4]   2> 787991 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.s.e.JettySolrRunner Jetty properties: 
{solr.data.dir=/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/collection1/data,
 hostContext=/solr, hostPort=56616}
   [junit4]   2> 787991 ERROR 
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging 
may be missing or incomplete.
   [junit4]   2> 787991 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr™ 
version 7.3.0
   [junit4]   2> 787991 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone 
mode on port null
   [junit4]   2> 787991 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 787991 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-12-31T18:36:38.938Z
   [junit4]   2> 787991 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Loading container configuration from 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/solr.xml
   [junit4]   2> 787996 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverWorkLoopDelay is ignored
   [junit4]   2> 787996 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 787997 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 788038 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 
'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788044 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 
'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788044 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788046 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/.
   [junit4]   2> 788047 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 788047 INFO  (coreLoadExecutor-2753-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 788065 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.3.0
   [junit4]   2> 788070 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 788072 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.2 with uniqueid field id
   [junit4]   2> 788072 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from instancedir 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/./collection1,
 trusted=true
   [junit4]   2> 788073 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788073 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 788073 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/collection1],
 
dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/./collection1/data/]
   [junit4]   2> 788074 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=22, maxMergeAtOnceExplicit=15, maxMergedSegmentMB=95.1201171875, 
floorSegmentMB=1.4306640625, forceMergeDeletesPctAllowed=21.370371859346882, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.27646467960975185
   [junit4]   2> 788115 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 788115 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 788115 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: 
minMergeSize=1677721, mergeFactor=13, maxMergeSize=2147483648, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.4861376921716811]
   [junit4]   2> 788115 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@23a47280[collection1] main]
   [junit4]   2> 788116 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to 
use dir: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/collection1/conf
   [junit4]   2> 788116 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Replication enabled for following 
config files: schema.xml,xslt/dummy.xsl
   [junit4]   2> 788116 INFO  (coreLoadExecutor-2753-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 788117 INFO  
(searcherExecutor-2754-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@23a47280[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 788119 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.SolrTestCaseJ4 Writing core.properties file to 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/collection1
   [junit4]   2> 788123 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.Server jetty-9.3.20.v20170531
   [junit4]   2> 788125 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@7eaf9148{/solr,null,AVAILABLE}
   [junit4]   2> 788125 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.AbstractConnector Started 
ServerConnector@13531e2{HTTP/1.1,[http/1.1]}{127.0.0.1:56617}
   [junit4]   2> 788125 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.Server Started @791378ms
   [junit4]   2> 788125 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.s.e.JettySolrRunner Jetty properties: 
{solr.data.dir=/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/collection1/data,
 hostContext=/solr, hostPort=56617}
   [junit4]   2> 788125 ERROR 
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging 
may be missing or incomplete.
   [junit4]   2> 788126 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr™ 
version 7.3.0
   [junit4]   2> 788126 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone 
mode on port null
   [junit4]   2> 788126 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 788126 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-12-31T18:36:39.073Z
   [junit4]   2> 788126 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Loading container configuration from 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/solr.xml
   [junit4]   2> 788130 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverWorkLoopDelay is ignored
   [junit4]   2> 788130 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 788131 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 788175 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 
'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788183 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 
'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788183 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788185 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/.
   [junit4]   2> 788185 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 788186 INFO  (coreLoadExecutor-2763-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 788202 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.3.0
   [junit4]   2> 788206 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 788208 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.2 with uniqueid field id
   [junit4]   2> 788209 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from instancedir 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/./collection1,
 trusted=true
   [junit4]   2> 788209 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788209 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 788209 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/collection1],
 
dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/./collection1/data/]
   [junit4]   2> 788210 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=22, maxMergeAtOnceExplicit=15, maxMergedSegmentMB=95.1201171875, 
floorSegmentMB=1.4306640625, forceMergeDeletesPctAllowed=21.370371859346882, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.27646467960975185
   [junit4]   2> 788262 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 788262 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 788263 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: 
minMergeSize=1677721, mergeFactor=13, maxMergeSize=2147483648, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.4861376921716811]
   [junit4]   2> 788263 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@414ef86c[collection1] main]
   [junit4]   2> 788264 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to 
use dir: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/collection1/conf
   [junit4]   2> 788266 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Poll scheduled at an interval of 
1000ms
   [junit4]   2> 788266 INFO  (coreLoadExecutor-2763-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 788267 INFO  
(searcherExecutor-2764-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@414ef86c[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 788268 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.AbstractConnector Stopped 
ServerConnector@13531e2{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
   [junit4]   2> 788268 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=169138167
   [junit4]   2> 788268 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> 788268 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@4561ce07: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@6f38abea
   [junit4]   2> 788273 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> 788273 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@1c695045: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@41467a66
   [junit4]   2> 788276 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> 788276 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@7f1b4ca9: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@2b6ffeeb
   [junit4]   2> 788277 INFO  (coreCloseExecutor-2769-thread-1) [    
x:collection1] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@50bff2d4
   [junit4]   2> 788277 INFO  (coreCloseExecutor-2769-thread-1) [    
x:collection1] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.core.collection1, tag=1354756820
   [junit4]   2> 788277 INFO  (coreCloseExecutor-2769-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@67e6bb19: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@6fa9154
   [junit4]   2> 788284 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@7eaf9148{/solr,null,UNAVAILABLE}
   [junit4]   2> 788286 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.AbstractConnector Stopped 
ServerConnector@29ba962d{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
   [junit4]   2> 788286 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=167098711
   [junit4]   2> 788286 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> 788286 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@682cbd3a: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@5d4a645a
   [junit4]   2> 788287 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> 788287 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@24f08038: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@41467a66
   [junit4]   2> 788288 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> 788288 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@5ae466af: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@2b6ffeeb
   [junit4]   2> 788288 INFO  (coreCloseExecutor-2771-thread-1) [    
x:collection1] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@2fd26d8f
   [junit4]   2> 788288 INFO  (coreCloseExecutor-2771-thread-1) [    
x:collection1] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.core.collection1, tag=802319759
   [junit4]   2> 788289 INFO  (coreCloseExecutor-2771-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@b70e339: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@3bd8ebf
   [junit4]   2> 788291 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@6cf84efe{/solr,null,UNAVAILABLE}
   [junit4]   2> 788292 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.Server jetty-9.3.20.v20170531
   [junit4]   2> 788293 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@3eb231c2{/solr,null,AVAILABLE}
   [junit4]   2> 788294 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.AbstractConnector Started 
ServerConnector@98a55ac{HTTP/1.1,[http/1.1]}{127.0.0.1:56618}
   [junit4]   2> 788294 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.Server Started @791547ms
   [junit4]   2> 788294 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.s.e.JettySolrRunner Jetty properties: 
{solr.data.dir=/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/collection1/data,
 hostContext=/solr, hostPort=56618}
   [junit4]   2> 788294 ERROR 
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging 
may be missing or incomplete.
   [junit4]   2> 788294 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr™ 
version 7.3.0
   [junit4]   2> 788294 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone 
mode on port null
   [junit4]   2> 788294 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 788294 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-12-31T18:36:39.241Z
   [junit4]   2> 788294 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Loading container configuration from 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/solr.xml
   [junit4]   2> 788299 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverWorkLoopDelay is ignored
   [junit4]   2> 788299 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 788299 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 788337 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 
'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788344 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 
'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788344 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788345 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/.
   [junit4]   2> 788345 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 788346 INFO  (coreLoadExecutor-2778-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 788362 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.3.0
   [junit4]   2> 788370 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 788372 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.2 with uniqueid field id
   [junit4]   2> 788372 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from instancedir 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/./collection1,
 trusted=true
   [junit4]   2> 788373 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788373 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 788373 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/collection1],
 
dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/./collection1/data/]
   [junit4]   2> 788374 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=22, maxMergeAtOnceExplicit=15, maxMergedSegmentMB=95.1201171875, 
floorSegmentMB=1.4306640625, forceMergeDeletesPctAllowed=21.370371859346882, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.27646467960975185
   [junit4]   2> 788415 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 788415 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 788415 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: 
minMergeSize=1677721, mergeFactor=13, maxMergeSize=2147483648, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.4861376921716811]
   [junit4]   2> 788415 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@7b87d11f[collection1] main]
   [junit4]   2> 788416 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to 
use dir: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/collection1/conf
   [junit4]   2> 788416 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Replication enabled for following 
config files: schema.xml
   [junit4]   2> 788416 INFO  (coreLoadExecutor-2778-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 788417 INFO  
(searcherExecutor-2779-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@7b87d11f[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 788421 INFO  (qtp733165745-7831) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 [collection1] REMOVING ALL DOCUMENTS FROM INDEX
   [junit4]   2> 788421 INFO  (qtp733165745-7831) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{deleteByQuery=*:*} 0 0
   [junit4]   2> 788422 INFO  (qtp733165745-7832) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 788422 INFO  (qtp733165745-7832) [    x:collection1] 
o.a.s.u.SolrIndexWriter Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@148509d1 commitCommandVersion:0
   [junit4]   2> 788422 INFO  (qtp733165745-7832) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@5b7fff0a[collection1] main]
   [junit4]   2> 788423 INFO  (qtp733165745-7832) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 788424 INFO  
(searcherExecutor-2779-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@5b7fff0a[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 788424 INFO  (qtp733165745-7832) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 2
   [junit4]   2> 788424 INFO  (qtp733165745-7833) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=*:*&sort=id+desc&wt=javabin&version=2} hits=0 status=0 QTime=0
   [junit4]   2> 788425 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.h.TestReplicationHandler Waited for 0ms and found 0 docs
   [junit4]   2> 788426 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.Server jetty-9.3.20.v20170531
   [junit4]   2> 788428 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@7e63e50b{/solr,null,AVAILABLE}
   [junit4]   2> 788428 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.AbstractConnector Started 
ServerConnector@70ee33dc{HTTP/1.1,[http/1.1]}{127.0.0.1:56620}
   [junit4]   2> 788428 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.Server Started @791681ms
   [junit4]   2> 788428 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.s.e.JettySolrRunner Jetty properties: 
{solr.data.dir=/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/collection1/data,
 hostContext=/solr, hostPort=56620}
   [junit4]   2> 788428 ERROR 
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging 
may be missing or incomplete.
   [junit4]   2> 788428 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr™ 
version 7.3.0
   [junit4]   2> 788428 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone 
mode on port null
   [junit4]   2> 788428 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 788428 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-12-31T18:36:39.375Z
   [junit4]   2> 788429 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Loading container configuration from 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/solr.xml
   [junit4]   2> 788434 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverWorkLoopDelay is ignored
   [junit4]   2> 788434 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 788434 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 788476 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 
'solr.node') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788488 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 
'solr.jvm') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788488 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788490 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/.
   [junit4]   2> 788490 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 788490 INFO  (coreLoadExecutor-2788-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 788506 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.3.0
   [junit4]   2> 788511 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 788513 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.2 with uniqueid field id
   [junit4]   2> 788513 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from instancedir 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/./collection1,
 trusted=true
   [junit4]   2> 788513 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788514 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 788514 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/collection1],
 
dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/./collection1/data/]
   [junit4]   2> 788515 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=22, maxMergeAtOnceExplicit=15, maxMergedSegmentMB=95.1201171875, 
floorSegmentMB=1.4306640625, forceMergeDeletesPctAllowed=21.370371859346882, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.27646467960975185
   [junit4]   2> 788560 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 788560 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 788560 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: 
minMergeSize=1677721, mergeFactor=13, maxMergeSize=2147483648, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.4861376921716811]
   [junit4]   2> 788560 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening [Searcher@65b5f92[collection1] 
main]
   [junit4]   2> 788561 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to 
use dir: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-002/collection1/conf
   [junit4]   2> 788563 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Poll scheduled at an interval of 
1000ms
   [junit4]   2> 788563 INFO  (coreLoadExecutor-2788-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 788568 INFO  
(searcherExecutor-2789-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@65b5f92[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 788570 INFO  (qtp1359208140-7849) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=*:*&sort=id+desc&wt=javabin&version=2} hits=0 status=0 QTime=0
   [junit4]   2> 788571 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.h.TestReplicationHandler Waited for 0ms and found 0 docs
   [junit4]   2> 788571 INFO  (qtp733165745-7834) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={_trace=getIndexVersion&qt=/replication&wt=javabin&version=2&command=indexversion}
 status=0 QTime=0
   [junit4]   2> 788572 INFO  (qtp733165745-7835) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={_trace=getCommits&qt=/replication&wt=javabin&version=2&command=commits} 
status=0 QTime=0
   [junit4]   2> 788587 INFO  (qtp733165745-7829) [    ] o.a.s.c.SolrConfig 
Using Lucene MatchVersion: 7.3.0
   [junit4]   2> 788591 INFO  (qtp733165745-7829) [    ] o.a.s.s.IndexSchema 
[collection1] Schema name=test
   [junit4]   2> 788593 INFO  (qtp733165745-7829) [    ] o.a.s.s.IndexSchema 
Loaded schema test/1.2 with uniqueid field id
   [junit4]   2> 788593 INFO  (qtp733165745-7829) [    ] o.a.s.c.CoreContainer 
Reloading SolrCore 'collection1' using configuration from instancedir 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/./collection1
   [junit4]   2> 788610 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.core.collection1' (registry 
'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 788611 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/collection1],
 
dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/./collection1/data/]
   [junit4]   2> 788658 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 788658 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 788660 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@2b6cfd9[collection1] main]
   [junit4]   2> 788660 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.r.ManagedResourceStorage File-based storage initialized to use dir: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-001/collection1/conf
   [junit4]   2> 788660 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.h.ReplicationHandler Replication enabled for following config files: 
schema.xml
   [junit4]   2> 788660 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 788661 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.AlcoholicMergePolicy: [AlcoholicMergePolicy: 
minMergeSize=0, mergeFactor=10, maxMergeSize=405362074, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.1]
   [junit4]   2> 788661 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used.
   [junit4]   2> 788662 INFO  
(searcherExecutor-2794-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@2b6cfd9[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 788662 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@2882c5dc[collection1] main]
   [junit4]   2> 788662 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.c.SolrCore [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@3b3872ff
   [junit4]   2> 788662 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.core.collection1, tag=993555199
   [junit4]   2> 788662 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@5bdb8e4c: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@7ad9f339
   [junit4]   2> 788663 INFO  
(searcherExecutor-2794-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@2882c5dc[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 788673 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.s.HttpSolrCall [admin] webapp=null path=/admin/cores 
params={core=collection1&qt=/admin/cores&action=reload&wt=javabin&version=2} 
status=0 QTime=99
   [junit4]   2> 788674 INFO  (qtp733165745-7831) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={_trace=getIndexVersion&qt=/replication&wt=javabin&version=2&command=indexversion}
 status=0 QTime=0
   [junit4]   2> 788675 INFO  (qtp733165745-7833) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={_trace=getCommits&qt=/replication&wt=javabin&version=2&command=commits} 
status=0 QTime=0
   [junit4]   2> 788675 INFO  (qtp733165745-7834) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[10]} 0 0
   [junit4]   2> 788676 INFO  (qtp733165745-7835) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[20]} 0 0
   [junit4]   2> 788676 INFO  (qtp733165745-7836) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 788676 INFO  (qtp733165745-7836) [    x:collection1] 
o.a.s.u.SolrIndexWriter Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@1bc6e91f commitCommandVersion:0
   [junit4]   2> 788679 INFO  (qtp733165745-7836) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@17d5e4cb[collection1] main]
   [junit4]   2> 788679 INFO  (qtp733165745-7836) [    x:collection1] 
o.a.s.u.DirectUpdateHandler2 end_commit_flush
   [junit4]   2> 788680 INFO  
(searcherExecutor-2794-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@17d5e4cb[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.3.0):c2)))}
   [junit4]   2> 788680 INFO  (qtp733165745-7836) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 4
   [junit4]   2> 788681 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=*:*&sort=id+desc&wt=javabin&version=2} hits=2 status=0 QTime=0
   [junit4]   2> 788681 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.h.TestReplicationHandler Waited for 0ms and found 2 docs
   [junit4]   2> 788682 INFO  (qtp1359208140-7850) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=*:*&sort=id+desc&wt=javabin&version=2} hits=0 status=0 QTime=0
   [junit4]   2> 788682 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.h.TestReplicationHandler Waiting for 2 docs
   [junit4]   2> 788769 INFO  (qtp733165745-7832) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={qt=/replication&wt=javabin&version=2&command=indexversion} status=0 
QTime=0
   [junit4]   2> 788770 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.h.IndexFetcher Master's generation: 3
   [junit4]   2> 788770 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.h.IndexFetcher Master's version: 1514745399623
   [junit4]   2> 788770 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.h.IndexFetcher Slave's generation: 1
   [junit4]   2> 788770 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.h.IndexFetcher Slave's version: 0
   [junit4]   2> 788770 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.h.IndexFetcher Starting replication process
   [junit4]   2> 788776 INFO  (qtp733165745-7833) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={generation=3&qt=/replication&tlogFiles=false&wt=javabin&version=2&command=filelist}
 status=0 QTime=5
   [junit4]   2> 788776 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.h.IndexFetcher Number of files in latest index in master: 4
   [junit4]   2> 788777 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: 
minMergeSize=1677721, mergeFactor=39, maxMergeSize=2147483648, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.8191794639014874]
   [junit4]   2> 788778 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used.
   [junit4]   2> 788778 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.h.IndexFetcher Starting download (fullCopy=false) to 
MockDirectoryWrapper(RAMDirectory@67724009 
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7f31a736)
   [junit4]   2> 788779 INFO  (qtp733165745-7834) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={generation=3&qt=/replication&file=_0.cfe&checksum=true&compression=true&wt=filestream&command=filecontent}
 status=0 QTime=0
   [junit4]   2> 788782 INFO  (qtp733165745-7835) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={generation=3&qt=/replication&file=_0.si&checksum=true&compression=true&wt=filestream&command=filecontent}
 status=0 QTime=0
   [junit4]   2> 788785 INFO  (qtp733165745-7836) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={generation=3&qt=/replication&file=_0.cfs&checksum=true&compression=true&wt=filestream&command=filecontent}
 status=0 QTime=0
   [junit4]   2> 788787 INFO  (qtp1359208140-7851) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=*:*&sort=id+desc&wt=javabin&version=2} hits=0 status=0 QTime=0
   [junit4]   2> 788787 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.h.TestReplicationHandler Waiting for 2 docs
   [junit4]   2> 788787 INFO  (qtp733165745-7829) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/replication 
params={generation=3&qt=/replication&file=segments_3&checksum=true&compression=true&wt=filestream&command=filecontent}
 status=0 QTime=0
   [junit4]   2> 788788 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.h.IndexFetcher Total time taken for download 
(fullCopy=false,bytesDownloaded=2004) : 0 secs (null bytes/sec) to 
MockDirectoryWrapper(RAMDirectory@67724009 
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@7f31a736)
   [junit4]   2> 788790 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: 
minMergeSize=1000, mergeFactor=23, maxMergeSize=9223372036854775807, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.4203545650509839]
   [junit4]   2> 788792 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.u.DefaultSolrCoreState New IndexWriter is ready to be used.
   [junit4]   2> 788792 INFO  (indexFetcher-2793-thread-1) [    x:collection1] 
o.a.s.s.SolrIndexSearcher Opening [Searcher@4a4747d9[collection1] main]
   [junit4]   2> 788795 INFO  
(searcherExecutor-2789-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@4a4747d9[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.3.0):c2)))}
   [junit4]   2> 788890 INFO  (qtp1359208140-7852) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=*:*&sort=id+desc&wt=javabin&version=2} hits=2 status=0 QTime=0
   [junit4]   2> 788890 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.h.TestReplicationHandler Waited for 200ms and found 2 docs
   [junit4]   2> 788890 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.SolrTestCaseJ4 ###Ending doTestReplicateAfterCoreReload
   [junit4]   2> 788891 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.AbstractConnector Stopped 
ServerConnector@98a55ac{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
   [junit4]   2> 788891 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=1649990864
   [junit4]   2> 788891 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> 788892 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@4841ae15: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@75e1208f
   [junit4]   2> 788896 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> 788896 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@3a6a6b2: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@41467a66
   [junit4]   2> 788900 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> 788900 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@2d6dc887: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@2b6ffeeb
   [junit4]   2> 788901 INFO  (coreCloseExecutor-2799-thread-1) [    
x:collection1] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@1006f6ff
   [junit4]   2> 788901 INFO  (coreCloseExecutor-2799-thread-1) [    
x:collection1] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.core.collection1, tag=268891903
   [junit4]   2> 788901 INFO  (coreCloseExecutor-2799-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@3c81fff9: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@7ad9f339
   [junit4]   2> 788912 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@3eb231c2{/solr,null,UNAVAILABLE}
   [junit4]   2> 788914 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.AbstractConnector Stopped 
ServerConnector@70ee33dc{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
   [junit4]   2> 788914 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=1969970130
   [junit4]   2> 788915 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> 788915 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@551e02a8: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@554a12c7
   [junit4]   2> 788921 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> 788921 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@50abbce5: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@41467a66
   [junit4]   2> 788927 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> 788927 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@411c87ed: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@2b6ffeeb
   [junit4]   2> 788928 INFO  (coreCloseExecutor-2801-thread-1) [    
x:collection1] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@2899ba9d
   [junit4]   2> 788928 INFO  (coreCloseExecutor-2801-thread-1) [    
x:collection1] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.core.collection1, tag=681163421
   [junit4]   2> 788928 INFO  (coreCloseExecutor-2801-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@55964f26: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@5926a044
   [junit4]   2> 788933 INFO  
(TEST-TestReplicationHandler.doTestReplicateAfterCoreReload-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@7e63e50b{/solr,null,UNAVAILABLE}
   [junit4]   2> 788937 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.SolrTestCaseJ4 ###Starting doTestStopPoll
   [junit4]   2> 788938 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.SolrTestCaseJ4 Writing core.properties file to 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-003/collection1
   [junit4]   2> 788942 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.e.j.s.Server jetty-9.3.20.v20170531
   [junit4]   2> 788944 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@7871284b{/solr,null,AVAILABLE}
   [junit4]   2> 788944 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@55ebd5e2{HTTP/1.1,[http/1.1]}{127.0.0.1:56624}
   [junit4]   2> 788945 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.e.j.s.Server Started @792197ms
   [junit4]   2> 788945 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: 
{solr.data.dir=/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-003/collection1/data,
 hostContext=/solr, hostPort=56624}
   [junit4]   2> 788945 ERROR 
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 788945 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr™ version 
7.3.0
   [junit4]   2> 788945 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone mode on 
port null
   [junit4]   2> 788945 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 788945 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-12-31T18:36:39.892Z
   [junit4]   2> 788946 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.SolrXmlConfig Loading container configuration from 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-003/solr.xml
   [junit4]   2> 788953 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay 
is ignored
   [junit4]   2> 788953 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 788954 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 789010 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 789017 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 789017 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 789020 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-003/.
   [junit4]   2> 789020 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 789020 INFO  (coreLoadExecutor-2808-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 789042 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.3.0
   [junit4]   2> 789045 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 789051 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.2 with uniqueid field id
   [junit4]   2> 789051 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from instancedir 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-003/./collection1,
 trusted=true
   [junit4]   2> 789052 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 789052 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 789052 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-003/collection1],
 
dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-003/./collection1/data/]
   [junit4]   2> 789053 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=22, maxMergeAtOnceExplicit=15, maxMergedSegmentMB=95.1201171875, 
floorSegmentMB=1.4306640625, forceMergeDeletesPctAllowed=21.370371859346882, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.27646467960975185
   [junit4]   2> 789110 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 789110 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 789111 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: 
minMergeSize=1677721, mergeFactor=13, maxMergeSize=2147483648, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.4861376921716811]
   [junit4]   2> 789111 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@20df3c7d[collection1] main]
   [junit4]   2> 789111 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to 
use dir: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-003/collection1/conf
   [junit4]   2> 789112 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Replication enabled for following 
config files: schema.xml,xslt/dummy.xsl
   [junit4]   2> 789112 INFO  (coreLoadExecutor-2808-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 789113 INFO  
(searcherExecutor-2809-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@20df3c7d[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 789114 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.SolrTestCaseJ4 Writing core.properties file to 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-004/collection1
   [junit4]   2> 789119 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.e.j.s.Server jetty-9.3.20.v20170531
   [junit4]   2> 789120 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.e.j.s.h.ContextHandler Started 
o.e.j.s.ServletContextHandler@43722c1a{/solr,null,AVAILABLE}
   [junit4]   2> 789121 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.e.j.s.AbstractConnector Started 
ServerConnector@239124a4{HTTP/1.1,[http/1.1]}{127.0.0.1:56625}
   [junit4]   2> 789121 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.e.j.s.Server Started @792374ms
   [junit4]   2> 789121 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.s.e.JettySolrRunner Jetty properties: 
{solr.data.dir=/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-004/collection1/data,
 hostContext=/solr, hostPort=56625}
   [junit4]   2> 789121 ERROR 
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.u.StartupLoggingUtils Missing Java Option solr.log.dir. Logging may be 
missing or incomplete.
   [junit4]   2> 789121 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.s.SolrDispatchFilter  ___      _       Welcome to Apache Solr™ version 
7.3.0
   [junit4]   2> 789121 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.s.SolrDispatchFilter / __| ___| |_ _   Starting in standalone mode on 
port null
   [junit4]   2> 789121 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.s.SolrDispatchFilter \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> 789121 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.s.SolrDispatchFilter |___/\___/_|_|    Start time: 
2017-12-31T18:36:40.068Z
   [junit4]   2> 789122 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.SolrXmlConfig Loading container configuration from 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-004/solr.xml
   [junit4]   2> 789126 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.SolrXmlConfig Configuration parameter autoReplicaFailoverWorkLoopDelay 
is ignored
   [junit4]   2> 789126 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.SolrXmlConfig Configuration parameter 
autoReplicaFailoverBadNodeExpiration is ignored
   [junit4]   2> 789126 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.SolrXmlConfig MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> 789176 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.node' (registry 'solr.node') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 789184 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jvm' (registry 'solr.jvm') 
enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 789184 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.m.r.SolrJmxReporter JMX monitoring for 'solr.jetty' (registry 
'solr.jetty') enabled at server: com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 789186 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.CorePropertiesLocator Found 1 core definitions underneath 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-004/.
   [junit4]   2> 789186 INFO  
(TEST-TestReplicationHandler.doTestStopPoll-seed#[30FAE5EFDBC7B0AE]) [    ] 
o.a.s.c.CorePropertiesLocator Cores are: [collection1]
   [junit4]   2> 789186 INFO  (coreLoadExecutor-2818-thread-1) [    ] 
o.a.s.c.TransientSolrCoreCacheDefault Allocating transient cache for 4 
transient cores
   [junit4]   2> 789201 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.c.SolrConfig Using Lucene MatchVersion: 7.3.0
   [junit4]   2> 789206 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.s.IndexSchema [collection1] Schema name=test
   [junit4]   2> 789208 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.s.IndexSchema Loaded schema test/1.2 with uniqueid field id
   [junit4]   2> 789208 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.c.CoreContainer Creating SolrCore 'collection1' using 
configuration from instancedir 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-004/./collection1,
 trusted=true
   [junit4]   2> 789208 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@273946be
   [junit4]   2> 789208 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.c.SolrCore solr.RecoveryStrategy.Builder
   [junit4]   2> 789208 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.c.SolrCore [[collection1] ] Opening new SolrCore at 
[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-004/collection1],
 
dataDir=[/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-004/./collection1/data/]
   [junit4]   2> 789210 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.TieredMergePolicy: [TieredMergePolicy: 
maxMergeAtOnce=22, maxMergeAtOnceExplicit=15, maxMergedSegmentMB=95.1201171875, 
floorSegmentMB=1.4306640625, forceMergeDeletesPctAllowed=21.370371859346882, 
segmentsPerTier=24.0, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.27646467960975185
   [junit4]   2> 789257 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Hard AutoCommit: disabled
   [junit4]   2> 789257 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.u.CommitTracker Soft AutoCommit: disabled
   [junit4]   2> 789258 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.u.RandomMergePolicy RandomMergePolicy wrapping class 
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy: 
minMergeSize=1677721, mergeFactor=13, maxMergeSize=2147483648, 
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, 
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, 
noCFSRatio=0.4861376921716811]
   [junit4]   2> 789258 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.s.SolrIndexSearcher Opening 
[Searcher@6455e020[collection1] main]
   [junit4]   2> 789259 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.r.ManagedResourceStorage File-based storage initialized to 
use dir: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001/solr-instance-004/collection1/conf
   [junit4]   2> 789261 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Poll scheduled at an interval of 
1000ms
   [junit4]   2> 789261 INFO  (coreLoadExecutor-2818-thread-1) [    
x:collection1] o.a.s.h.ReplicationHandler Commits will be reserved for 10000ms.
   [junit4]   2> 789261 INFO  
(searcherExecutor-2819-thread-1-processing-x:collection1) [    x:collection1] 
o.a.s.c.SolrCore [collection1] Registered new searcher 
Searcher@6455e020[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> 789263 INFO  (qtp1457723376-7878) [    x:collection1] 
o.a.s.c.S.Request [collection1]  webapp=/solr path=/select 
params={q=*:*&sort=id+desc&wt=javabin&version=2} hits=0 status=0 QTime=0
   [junit4]   2> 789264 INFO  (qtp1457723376-7879) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[0]} 0 0
   [junit4]   2> 789265 INFO  (qtp1457723376-7880) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[1]} 0 0
   [junit4]   2> 789265 INFO  (qtp1457723376-7881) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[2]} 0 0
   [junit4]   2> 789266 INFO  (qtp1457723376-7882) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[3]} 0 0
   [junit4]   2> 789266 INFO  (qtp1457723376-7883) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[4]} 0 0
   [junit4]   2> 789267 INFO  (qtp1457723376-7876) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[5]} 0 0
   [junit4]   2> 789267 INFO  (qtp1457723376-7878) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[6]} 0 0
   [junit4]   2> 789268 INFO  (qtp1457723376-7878) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[7]} 0 0
   [junit4]   2> 789269 INFO  (qtp1457723376-7878) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[8]} 0 0
   [junit4]   2> 789270 INFO  (qtp1457723376-7878) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[9]} 0 0
   [junit4]   2> 789270 INFO  (qtp1457723376-7882) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[10]} 0 0
   [junit4]   2> 789271 INFO  (qtp1457723376-7883) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[11]} 0 0
   [junit4]   2> 789271 INFO  (qtp1457723376-7876) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[12]} 0 0
   [junit4]   2> 789271 INFO  (qtp1457723376-7879) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[13]} 0 0
   [junit4]   2> 789272 INFO  (qtp1457723376-7880) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[14]} 0 0
   [junit4]   2> 789272 INFO  (qtp1457723376-7881) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[15]} 0 0
   [junit4]   2> 789273 INFO  (qtp1457723376-7878) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[16]} 0 0
   [junit4]   2> 789273 INFO  (qtp1457723376-7882) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[17]} 0 0
   [junit4]   2> 789274 INFO  (qtp1457723376-7883) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[18]} 0 0
   [junit4]   2> 789274 INFO  (qtp1457723376-7876) [    x:collection1] 
o.a.s.u.p.LogUpdateProcessorFactory [collection1]  webapp=/solr path=/update 
params={wt=javabin&version=2}{add=[19]} 0 0
   [junit4]   2> 7892

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

0AE]) [    ] o.e.j.s.AbstractConnector Stopped 
ServerConnector@65e003fb{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
   [junit4]   2> 872036 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=1890569202
   [junit4]   2> 872036 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> 872036 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@2c93f8e0: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@70cd3ca9
   [junit4]   2> 872037 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> 872037 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@6e7d8d95: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@41467a66
   [junit4]   2> 872044 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> 872044 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@55277654: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@2b6ffeeb
   [junit4]   2> 872045 INFO  (coreCloseExecutor-3426-thread-1) [    
x:collection1] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@1dcf254a
   [junit4]   2> 872045 INFO  (coreCloseExecutor-3426-thread-1) [    
x:collection1] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.core.collection1, tag=500114762
   [junit4]   2> 872045 INFO  (coreCloseExecutor-3426-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@61dcba47: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@c79a071
   [junit4]   2> 872067 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@541ed444{/solr,null,UNAVAILABLE}
   [junit4]   2> 872069 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.AbstractConnector Stopped 
ServerConnector@3e3b75f9{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
   [junit4]   2> 872069 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.c.CoreContainer Shutting down CoreContainer instance=1812235256
   [junit4]   2> 872069 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> 872069 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@4300308b: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@19031c15
   [junit4]   2> 872077 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> 872077 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@677e5b18: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@41467a66
   [junit4]   2> 872085 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> 872085 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@2ff7daa7: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@2b6ffeeb
   [junit4]   2> 872086 INFO  (coreCloseExecutor-3428-thread-1) [    
x:collection1] o.a.s.c.SolrCore [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@11eeb6e9
   [junit4]   2> 872086 INFO  (coreCloseExecutor-3428-thread-1) [    
x:collection1] o.a.s.m.SolrMetricManager Closing metric reporters for 
registry=solr.core.collection1, tag=300857065
   [junit4]   2> 872086 INFO  (coreCloseExecutor-3428-thread-1) [    
x:collection1] o.a.s.m.r.SolrJmxReporter Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@1c6666ad: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@169f24aa
   [junit4]   2> 872100 INFO  
(TEST-TestReplicationHandler.doTestIndexAndConfigAliasReplication-seed#[30FAE5EFDBC7B0AE])
 [    ] o.e.j.s.h.ContextHandler Stopped 
o.e.j.s.ServletContextHandler@661a7700{/solr,null,UNAVAILABLE}
   [junit4]   2> NOTE: leaving temporary files on disk at: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/J0/temp/solr.handler.TestReplicationHandler_30FAE5EFDBC7B0AE-001
   [junit4]   2> NOTE: test params are: codec=Asserting(Lucene70): 
{name=PostingsFormat(name=LuceneFixedGap), 
id=PostingsFormat(name=LuceneFixedGap), 
newname=PostingsFormat(name=LuceneFixedGap)}, docValues:{}, 
maxPointsInLeafNode=1690, maxMBSortInHeap=7.696922989630577, 
sim=RandomSimilarity(queryNorm=false): {}, locale=es-US, timezone=Iceland
   [junit4]   2> NOTE: Mac OS X 10.11.6 x86_64/Oracle Corporation 1.8.0_144 
(64-bit)/cpus=3,threads=1,free=176808040,total=237273088
   [junit4]   2> NOTE: All tests run in this JVM: [SolrXmlInZkTest, 
TestSegmentSorting, TestScoreJoinQPNoScore, OverseerModifyCollectionTest, 
TestSolr4Spatial, IndexBasedSpellCheckerTest, RulesTest, CdcrBidirectionalTest, 
RankQueryTest, DistributedQueryElevationComponentTest, 
TestPayloadCheckQParserPlugin, HdfsThreadLeakTest, TestJmxIntegration, 
TestManagedSynonymGraphFilterFactory, CollectionTooManyReplicasTest, 
TestFieldCacheReopen, SolrIndexMetricsTest, TestSchemaSimilarityResource, 
HdfsBasicDistributedZk2Test, TestDistribStateManager, 
TestComplexPhraseLeadingWildcard, TestManagedStopFilterFactory, 
SortByFunctionTest, TestTolerantUpdateProcessorRandomCloud, ConfigSetsAPITest, 
RecoveryZkTest, MigrateRouteKeyTest, DefaultValueUpdateProcessorTest, 
BinaryUpdateRequestHandlerTest, ChaosMonkeyNothingIsSafeTest, TestSmileRequest, 
CloneFieldUpdateProcessorFactoryTest, TestSolrXml, FullHLLTest, 
DistributedSpellCheckComponentTest, TestHdfsBackupRestoreCore, 
SubstringBytesRefFilterTest, TestSubQueryTransformerDistrib, 
TlogReplayBufferedWhileIndexingTest, ZkStateReaderTest, 
ConfigureRecoveryStrategyTest, SpatialHeatmapFacetsTest, 
TestCloudSearcherWarming, SliceStateTest, DeleteShardTest, 
SpellCheckComponentTest, TestSolrQueryResponse, TestInPlaceUpdatesDistrib, 
AsyncCallRequestStatusResponseTest, TestPHPSerializedResponseWriter, 
TestCloudNestedDocsSort, SolrGangliaReporterTest, TestHalfAndHalfDocValues, 
TestRuleBasedAuthorizationPlugin, TestReqParamsAPI, SolrMetricReporterTest, 
UninvertDocValuesMergePolicyTest, TestMacroExpander, SuggesterTSTTest, 
TemplateUpdateProcessorTest, TestDeleteCollectionOnDownNodes, 
TestConfigSetsAPI, DateFieldTest, DistributedQueryComponentOptimizationTest, 
TestQueryWrapperFilter, TestPolicyCloud, TestSearcherReuse, OverseerStatusTest, 
TestAtomicUpdateErrorCases, AddReplicaTest, DistribJoinFromCollectionTest, 
TestWriterPerf, TestSubQueryTransformer, TestLFUCache, TestReplicationHandler]
   [junit4] Completed [178/764 (1!)] on J0 in 84.14s, 16 tests, 1 error, 1 
skipped <<< FAILURES!

[...truncated 1998 lines...]
   [junit4] JVM J0: stdout was not empty, see: 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/solr/build/solr-core/test/temp/junit4-J0-20171231_182327_6262857466627263158767.sysout
   [junit4] >>> JVM J0 emitted unexpected output (verbatim) ----
   [junit4] java.lang.OutOfMemoryError: Java heap space
   [junit4] Dumping heap to 
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/heapdumps/java_pid33877.hprof 
...
   [junit4] Heap dump file created [146264375 bytes in 1.961 secs]
   [junit4] <<< JVM J0: EOF ----

[...truncated 8564 lines...]
BUILD FAILED
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/build.xml:835: The following 
error occurred while executing this line:
/Users/jenkins/workspace/Lucene-Solr-7.x-MacOSX/build.xml:787: Some of the 
tests produced a heap dump, but did not fail. Maybe a suppressed 
OutOfMemoryError? Dumps created:
* java_pid33877.hprof

Total time: 95 minutes 53 seconds
Build step 'Invoke Ant' marked build as failure
Archiving artifacts
[WARNINGS] Skipping publisher since build result is FAILURE
Recording test results
Email was triggered for: Failure - Any
Sending email for trigger: Failure - Any
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]

Reply via email to