Return-Path: X-Original-To: apmail-lucene-dev-archive@www.apache.org Delivered-To: apmail-lucene-dev-archive@www.apache.org Received: from mail.apache.org (hermes.apache.org [140.211.11.3]) by minotaur.apache.org (Postfix) with SMTP id 8AA1410CF6 for ; Sat, 3 Aug 2013 15:25:08 +0000 (UTC) Received: (qmail 83987 invoked by uid 500); 3 Aug 2013 15:25:06 -0000 Delivered-To: apmail-lucene-dev-archive@lucene.apache.org Received: (qmail 83941 invoked by uid 500); 3 Aug 2013 15:25:06 -0000 Mailing-List: contact dev-help@lucene.apache.org; run by ezmlm Precedence: bulk List-Help: List-Unsubscribe: List-Post: List-Id: Reply-To: dev@lucene.apache.org Delivered-To: mailing list dev@lucene.apache.org Received: (qmail 83934 invoked by uid 99); 3 Aug 2013 15:25:05 -0000 Received: from athena.apache.org (HELO athena.apache.org) (140.211.11.136) by apache.org (qpsmtpd/0.29) with ESMTP; Sat, 03 Aug 2013 15:25:05 +0000 X-ASF-Spam-Status: No, hits=-2000.0 required=5.0 tests=ALL_TRUSTED,NORMAL_HTTP_TO_IP,WEIRD_PORT X-Spam-Check-By: apache.org Received: from [140.211.11.8] (HELO aegis.apache.org) (140.211.11.8) by apache.org (qpsmtpd/0.29) with ESMTP; Sat, 03 Aug 2013 15:25:00 +0000 Received: from aegis.apache.org (localhost [127.0.0.1]) by aegis.apache.org (Postfix) with ESMTP id B09DEC0309 for ; Sat, 3 Aug 2013 15:24:39 +0000 (UTC) Date: Sat, 3 Aug 2013 15:24:17 +0000 (UTC) From: Apache Jenkins Server To: dev@lucene.apache.org Message-ID: <1914519663.3933.1375543479712.JavaMail.hudson@aegis> In-Reply-To: <1051992323.3831.1375519943478.JavaMail.hudson@aegis> References: <1051992323.3831.1375519943478.JavaMail.hudson@aegis> Subject: [JENKINS] Lucene-Solr-Tests-trunk-Java7 - Build # 4207 - Still Failing MIME-Version: 1.0 Content-Type: multipart/mixed; boundary="----=_Part_3932_1686263148.1375543457230" X-Jenkins-Job: Lucene-Solr-Tests-trunk-Java7 X-Jenkins-Result: FAILURE X-Virus-Checked: Checked by ClamAV on apache.org ------=_Part_3932_1686263148.1375543457230 Content-Type: text/plain; charset=UTF-8 Content-Transfer-Encoding: quoted-printable Build: https://builds.apache.org/job/Lucene-Solr-Tests-trunk-Java7/4207/ 1 tests failed. FAILED: org.apache.solr.cloud.CollectionsAPIDistributedZkTest.testDistribS= earch Error Message: IOException occured when talking to server at: http://127.0.0.1:22940 Stack Trace: org.apache.solr.client.solrj.SolrServerException: IOException occured when = talking to server at: http://127.0.0.1:22940 =09at __randomizedtesting.SeedInfo.seed([A0DBC4A68435BE3C:213D4ABEF36ADE00]= :0) =09at org.apache.solr.client.solrj.impl.HttpSolrServer.request(HttpSolrServ= er.java:435) =09at org.apache.solr.client.solrj.impl.HttpSolrServer.request(HttpSolrServ= er.java:180) =09at org.apache.solr.cloud.AbstractFullDistribZkTestBase.createCollection(= AbstractFullDistribZkTestBase.java:1535) =09at org.apache.solr.cloud.CollectionsAPIDistributedZkTest.testCustomColle= ctionsAPI(CollectionsAPIDistributedZkTest.java:677) =09at org.apache.solr.cloud.CollectionsAPIDistributedZkTest.doTest(Collecti= onsAPIDistributedZkTest.java:159) =09at org.apache.solr.BaseDistributedSearchTestCase.testDistribSearch(BaseD= istributedSearchTestCase.java:835) =09at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) =09at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.= java:57) =09at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAcces= sorImpl.java:43) =09at java.lang.reflect.Method.invoke(Method.java:606) =09at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(Randomized= Runner.java:1559) =09at com.carrotsearch.randomizedtesting.RandomizedRunner.access$600(Random= izedRunner.java:79) =09at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(Random= izedRunner.java:737) =09at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(Random= izedRunner.java:773) =09at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(Random= izedRunner.java:787) =09at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$= 1.evaluate(SystemPropertiesRestoreRule.java:53) =09at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRu= leSetupTeardownChained.java:50) =09at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFi= eldCacheSanity.java:51) =09at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBef= oreAfterRule.java:46) =09at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRul= e$1.evaluate(SystemPropertiesInvariantRule.java:55) =09at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleT= hreadAndTestName.java:49) =09at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(Test= RuleIgnoreAfterMaxFailures.java:70) =09at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFai= lure.java:48) =09at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(St= atementAdapter.java:36) =09at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.= run(ThreadLeakControl.java:358) =09at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTa= sk(ThreadLeakControl.java:782) =09at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(Threa= dLeakControl.java:442) =09at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(Ran= domizedRunner.java:746) =09at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(Random= izedRunner.java:648) =09at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(Random= izedRunner.java:682) =09at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(Random= izedRunner.java:693) =09at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(St= atementAdapter.java:36) =09at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$= 1.evaluate(SystemPropertiesRestoreRule.java:53) =09at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBef= oreAfterRule.java:46) =09at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStor= eClassName.java:42) =09at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRul= e$1.evaluate(SystemPropertiesInvariantRule.java:55) =09at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMeth= odsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39) =09at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMeth= odsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39) =09at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(St= atementAdapter.java:36) =09at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRule= AssertionsRequired.java:43) =09at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFai= lure.java:48) =09at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(Test= RuleIgnoreAfterMaxFailures.java:70) =09at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIg= noreTestSuites.java:55) =09at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(St= atementAdapter.java:36) =09at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.= run(ThreadLeakControl.java:358) =09at java.lang.Thread.run(Thread.java:724) Caused by: org.apache.http.conn.ConnectTimeoutException: Connect to 127.0.0= .1:22940 timed out =09at org.apache.http.conn.scheme.PlainSocketFactory.connectSocket(PlainSoc= ketFactory.java:129) =09at org.apache.http.impl.conn.DefaultClientConnectionOperator.openConnect= ion(DefaultClientConnectionOperator.java:180) =09at org.apache.http.impl.conn.ManagedClientConnectionImpl.open(ManagedCli= entConnectionImpl.java:294) =09at org.apache.http.impl.client.DefaultRequestDirector.tryConnect(Default= RequestDirector.java:645) =09at org.apache.http.impl.client.DefaultRequestDirector.execute(DefaultReq= uestDirector.java:480) =09at org.apache.http.impl.client.AbstractHttpClient.execute(AbstractHttpCl= ient.java:906) =09at org.apache.http.impl.client.AbstractHttpClient.execute(AbstractHttpCl= ient.java:805) =09at org.apache.http.impl.client.AbstractHttpClient.execute(AbstractHttpCl= ient.java:784) =09at org.apache.solr.client.solrj.impl.HttpSolrServer.request(HttpSolrServ= er.java:365) =09... 45 more Build Log: [...truncated 9698 lines...] [junit4] Suite: org.apache.solr.cloud.CollectionsAPIDistributedZkTest [junit4] 2> 823023 T2115 oas.BaseDistributedSearchTestCase.initHostCon= text Setting hostContext system property: / [junit4] 2> 823027 T2115 oas.SolrTestCaseJ4.setUp ###Starting testDist= ribSearch [junit4] 2> Creating dataDir: /usr/home/hudson/hudson-slave/workspace/= Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./solrtest-Colle= ctionsAPIDistributedZkTest-1375542114809 [junit4] 2> 823028 T2115 oasc.ZkTestServer.run STARTING ZK TEST SERVER [junit4] 2> 823029 T2116 oasc.ZkTestServer$ZKServerMain.runFromConfig = Starting server [junit4] 2> 823130 T2115 oasc.ZkTestServer.run start zk server on port= :22930 [junit4] 2> 823131 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 823136 T2122 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@5355e98d name:ZooKeeperConnection= Watcher:127.0.0.1:22930 got event WatchedEvent state:SyncConnected type:No= ne path:null path:null type:None [junit4] 2> 823136 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 823137 T2115 oascc.SolrZkClient.makePath makePath: /solr [junit4] 2> 823154 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 823156 T2124 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@4f015c6b name:ZooKeeperConnection= Watcher:127.0.0.1:22930/solr got event WatchedEvent state:SyncConnected ty= pe:None path:null path:null type:None [junit4] 2> 823156 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 823157 T2115 oascc.SolrZkClient.makePath makePath: /collec= tions/collection1 [junit4] 2> 823167 T2115 oascc.SolrZkClient.makePath makePath: /collec= tions/collection1/shards [junit4] 2> 823170 T2115 oascc.SolrZkClient.makePath makePath: /collec= tions/control_collection [junit4] 2> 823172 T2115 oascc.SolrZkClient.makePath makePath: /collec= tions/control_collection/shards [junit4] 2> 823176 T2115 oasc.AbstractZkTestCase.putConfig put /usr/ho= me/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/s= olr-core/test-files/solr/collection1/conf/solrconfig-tlog.xml to /configs/c= onf1/solrconfig.xml [junit4] 2> 823177 T2115 oascc.SolrZkClient.makePath makePath: /config= s/conf1/solrconfig.xml [junit4] 2> 823189 T2115 oasc.AbstractZkTestCase.putConfig put /usr/ho= me/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/s= olr-core/test-files/solr/collection1/conf/schema.xml to /configs/conf1/sche= ma.xml [junit4] 2> 823190 T2115 oascc.SolrZkClient.makePath makePath: /config= s/conf1/schema.xml [junit4] 2> 823295 T2115 oasc.AbstractZkTestCase.putConfig put /usr/ho= me/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/s= olr-core/test-files/solr/collection1/conf/stopwords.txt to /configs/conf1/s= topwords.txt [junit4] 2> 823296 T2115 oascc.SolrZkClient.makePath makePath: /config= s/conf1/stopwords.txt [junit4] 2> 823299 T2115 oasc.AbstractZkTestCase.putConfig put /usr/ho= me/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/s= olr-core/test-files/solr/collection1/conf/protwords.txt to /configs/conf1/p= rotwords.txt [junit4] 2> 823300 T2115 oascc.SolrZkClient.makePath makePath: /config= s/conf1/protwords.txt [junit4] 2> 823310 T2115 oasc.AbstractZkTestCase.putConfig put /usr/ho= me/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/s= olr-core/test-files/solr/collection1/conf/currency.xml to /configs/conf1/cu= rrency.xml [junit4] 2> 823310 T2115 oascc.SolrZkClient.makePath makePath: /config= s/conf1/currency.xml [junit4] 2> 823314 T2115 oasc.AbstractZkTestCase.putConfig put /usr/ho= me/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/s= olr-core/test-files/solr/collection1/conf/open-exchange-rates.json to /conf= igs/conf1/open-exchange-rates.json [junit4] 2> 823315 T2115 oascc.SolrZkClient.makePath makePath: /config= s/conf1/open-exchange-rates.json [junit4] 2> 823318 T2115 oasc.AbstractZkTestCase.putConfig put /usr/ho= me/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/s= olr-core/test-files/solr/collection1/conf/mapping-ISOLatin1Accent.txt to /c= onfigs/conf1/mapping-ISOLatin1Accent.txt [junit4] 2> 823319 T2115 oascc.SolrZkClient.makePath makePath: /config= s/conf1/mapping-ISOLatin1Accent.txt [junit4] 2> 823322 T2115 oasc.AbstractZkTestCase.putConfig put /usr/ho= me/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/s= olr-core/test-files/solr/collection1/conf/old_synonyms.txt to /configs/conf= 1/old_synonyms.txt [junit4] 2> 823323 T2115 oascc.SolrZkClient.makePath makePath: /config= s/conf1/old_synonyms.txt [junit4] 2> 823326 T2115 oasc.AbstractZkTestCase.putConfig put /usr/ho= me/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/s= olr-core/test-files/solr/collection1/conf/synonyms.txt to /configs/conf1/sy= nonyms.txt [junit4] 2> 823327 T2115 oascc.SolrZkClient.makePath makePath: /config= s/conf1/synonyms.txt [junit4] 2> 823612 T2115 oejs.Server.doStart jetty-8.1.10.v20130312 [junit4] 2> 823618 T2115 oejs.AbstractConnector.doStart Started Socket= Connector@127.0.0.1:22933 [junit4] 2> 823618 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() [junit4] 2> 823619 T2115 oasc.SolrResourceLoader.locateSolrHome JNDI n= ot configured for solr (NoInitialContextEx) [junit4] 2> 823620 T2115 oasc.SolrResourceLoader.locateSolrHome using = system property solr.solr.home: /usr/home/hudson/hudson-slave/workspace/Luc= ene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.c= loud.CollectionsAPIDistributedZkTest-controljetty-1375542115112 [junit4] 2> 823620 T2115 oasc.SolrResourceLoader. new SolrResour= ceLoader for directory: '/usr/home/hudson/hudson-slave/workspace/Lucene-Sol= r-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Co= llectionsAPIDistributedZkTest-controljetty-1375542115112/' [junit4] 2> 823662 T2115 oasc.ConfigSolr.fromFile Loading container co= nfiguration from /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-= trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Collection= sAPIDistributedZkTest-controljetty-1375542115112/solr.xml [junit4] 2> 823756 T2115 oasc.ConfigSolrXml. Config-defined core= root directory:=20 [junit4] 2> 823757 T2115 oasc.CoreContainer. New CoreContainer 8= 55685611 [junit4] 2> 823758 T2115 oasc.CoreContainer.load Loading cores into Co= reContainer [instanceDir=3D/usr/home/hudson/hudson-slave/workspace/Lucene-S= olr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.= CollectionsAPIDistributedZkTest-controljetty-1375542115112/] [junit4] 2> 823760 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting socketTimeout to: 120000 [junit4] 2> 823761 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting urlScheme to: http:// [junit4] 2> 823761 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting connTimeout to: 15000 [junit4] 2> 823761 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxConnectionsPerHost to: 20 [junit4] 2> 823762 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting corePoolSize to: 0 [junit4] 2> 823762 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maximumPoolSize to: 2147483647 [junit4] 2> 823763 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxThreadIdleTime to: 5 [junit4] 2> 823763 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting sizeOfQueue to: -1 [junit4] 2> 823764 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting fairnessPolicy to: false [junit4] 2> 823765 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnectionsPerHost=3D20&maxConnections=3D10000&so= cketTimeout=3D120000&connTimeout=3D15000&retry=3Dfalse [junit4] 2> 823783 T2115 oasc.ZkContainer.initZooKeeper Zookeeper clie= nt=3D127.0.0.1:22930/solr [junit4] 2> 823784 T2115 oasc.ZkController.checkChrootPath zkHost incl= udes chroot [junit4] 2> 823785 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 823788 T2135 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@660e378c name:ZooKeeperConnection= Watcher:127.0.0.1:22930 got event WatchedEvent state:SyncConnected type:No= ne path:null path:null type:None [junit4] 2> 823788 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 823798 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D500&maxConnectionsPerHost=3D16&sock= etTimeout=3D120000&connTimeout=3D15000 [junit4] 2> 823811 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 823813 T2137 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@4a5833ae name:ZooKeeperConnection= Watcher:127.0.0.1:22930/solr got event WatchedEvent state:SyncConnected ty= pe:None path:null path:null type:None [junit4] 2> 823813 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 823816 T2115 oascc.SolrZkClient.makePath makePath: /overse= er/queue [junit4] 2> 823825 T2115 oascc.SolrZkClient.makePath makePath: /overse= er/collection-queue-work [junit4] 2> 823829 T2115 oascc.SolrZkClient.makePath makePath: /live_n= odes [junit4] 2> 823859 T2115 oasc.ZkController.createEphemeralLiveNode Reg= ister node as live in ZooKeeper:/live_nodes/127.0.0.1:22933_ [junit4] 2> 823861 T2115 oascc.SolrZkClient.makePath makePath: /live_n= odes/127.0.0.1:22933_ [junit4] 2> 823871 T2115 oascc.SolrZkClient.makePath makePath: /overse= er_elect/election [junit4] 2> 823884 T2115 oascc.SolrZkClient.makePath makePath: /overse= er_elect/leader [junit4] 2> 823888 T2115 oasc.Overseer.start Overseer (id=3D9014752803= 6450307-127.0.0.1:22933_-n_0000000000) starting [junit4] 2> 823899 T2115 oascc.SolrZkClient.makePath makePath: /overse= er/queue-work [junit4] 2> 823909 T2139 oasc.OverseerCollectionProcessor.run Process = current queue of collection creations [junit4] 2> 823909 T2115 oascc.SolrZkClient.makePath makePath: /cluste= rstate.json [junit4] 2> 823912 T2115 oascc.SolrZkClient.makePath makePath: /aliase= s.json [junit4] 2> 823919 T2115 oascc.ZkStateReader.createClusterStateWatcher= sAndUpdate Updating cluster state from ZooKeeper...=20 [junit4] 2> 823922 T2138 oasc.Overseer$ClusterStateUpdater.run Startin= g to work on the main queue [junit4] 2> 823926 T2115 oasc.CorePropertiesLocator.discover Looking f= or core definitions underneath /usr/home/hudson/hudson-slave/workspace/Luce= ne-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cl= oud.CollectionsAPIDistributedZkTest-controljetty-1375542115112 [junit4] 2> 823930 T2115 oasc.CorePropertiesLocator.discoverUnder Foun= d core conf in /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-tr= unk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsA= PIDistributedZkTest-controljetty-1375542115112/conf/ [junit4] 2> 824106 T2115 oasc.CorePropertiesLocator.discover Found 1 c= ore definitions [junit4] 2> 824107 T2115 oass.SolrDispatchFilter.init user.dir=3D/usr/= home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build= /solr-core/test/J1 [junit4] 2> 824107 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() done [junit4] 2> 824108 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D128&maxConnectionsPerHost=3D32&foll= owRedirects=3Dfalse [junit4] 2> 824126 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config: [junit4] 2> 824128 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 824130 T2142 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@4805376d name:ZooKeeperConnection= Watcher:127.0.0.1:22930/solr got event WatchedEvent state:SyncConnected ty= pe:None path:null path:null type:None [junit4] 2> 824130 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 824133 T2115 oascc.ZkStateReader.createClusterStateWatcher= sAndUpdate Updating cluster state from ZooKeeper...=20 [junit4] 2> 824135 T2115 oasc.ChaosMonkey.monkeyLog monkey: init - exp= ire sessions:true cause connection loss:true [junit4] 2> 824427 T2115 oejs.Server.doStart jetty-8.1.10.v20130312 [junit4] 2> 824430 T2115 oejs.AbstractConnector.doStart Started Socket= Connector@127.0.0.1:22937 [junit4] 2> 824431 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() [junit4] 2> 824431 T2115 oasc.SolrResourceLoader.locateSolrHome JNDI n= ot configured for solr (NoInitialContextEx) [junit4] 2> 824432 T2115 oasc.SolrResourceLoader.locateSolrHome using = system property solr.solr.home: /usr/home/hudson/hudson-slave/workspace/Luc= ene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.c= loud.CollectionsAPIDistributedZkTest-jetty1-1375542115917 [junit4] 2> 824432 T2115 oasc.SolrResourceLoader. new SolrResour= ceLoader for directory: '/usr/home/hudson/hudson-slave/workspace/Lucene-Sol= r-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Co= llectionsAPIDistributedZkTest-jetty1-1375542115917/' [junit4] 2> 824477 T2115 oasc.ConfigSolr.fromFile Loading container co= nfiguration from /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-= trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Collection= sAPIDistributedZkTest-jetty1-1375542115917/solr.xml [junit4] 2> 824575 T2115 oasc.ConfigSolrXml. Config-defined core= root directory:=20 [junit4] 2> 824576 T2115 oasc.CoreContainer. New CoreContainer 1= 345369951 [junit4] 2> 824576 T2115 oasc.CoreContainer.load Loading cores into Co= reContainer [instanceDir=3D/usr/home/hudson/hudson-slave/workspace/Lucene-S= olr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.= CollectionsAPIDistributedZkTest-jetty1-1375542115917/] [junit4] 2> 824578 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting socketTimeout to: 120000 [junit4] 2> 824578 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting urlScheme to: http:// [junit4] 2> 824578 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting connTimeout to: 15000 [junit4] 2> 824579 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxConnectionsPerHost to: 20 [junit4] 2> 824579 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting corePoolSize to: 0 [junit4] 2> 824579 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maximumPoolSize to: 2147483647 [junit4] 2> 824580 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxThreadIdleTime to: 5 [junit4] 2> 824580 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting sizeOfQueue to: -1 [junit4] 2> 824580 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting fairnessPolicy to: false [junit4] 2> 824581 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnectionsPerHost=3D20&maxConnections=3D10000&so= cketTimeout=3D120000&connTimeout=3D15000&retry=3Dfalse [junit4] 2> 824593 T2115 oasc.ZkContainer.initZooKeeper Zookeeper clie= nt=3D127.0.0.1:22930/solr [junit4] 2> 824593 T2115 oasc.ZkController.checkChrootPath zkHost incl= udes chroot [junit4] 2> 824594 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 824597 T2153 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@25ffdefe name:ZooKeeperConnection= Watcher:127.0.0.1:22930 got event WatchedEvent state:SyncConnected type:No= ne path:null path:null type:None [junit4] 2> 824597 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 824612 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D500&maxConnectionsPerHost=3D16&sock= etTimeout=3D120000&connTimeout=3D15000 [junit4] 2> 824620 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 824622 T2155 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@137554fc name:ZooKeeperConnection= Watcher:127.0.0.1:22930/solr got event WatchedEvent state:SyncConnected ty= pe:None path:null path:null type:None [junit4] 2> 824622 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 824631 T2115 oascc.ZkStateReader.createClusterStateWatcher= sAndUpdate Updating cluster state from ZooKeeper...=20 [junit4] 2> 825633 T2115 oasc.ZkController.createEphemeralLiveNode Reg= ister node as live in ZooKeeper:/live_nodes/127.0.0.1:22937_ [junit4] 2> 825636 T2115 oascc.SolrZkClient.makePath makePath: /live_n= odes/127.0.0.1:22937_ [junit4] 2> 825639 T2137 oascc.ZkStateReader$3.process Updating live n= odes... (2) [junit4] 2> 825639 T2142 oascc.ZkStateReader$3.process Updating live n= odes... (2) [junit4] 2> 825639 T2155 oascc.ZkStateReader$3.process Updating live n= odes... (2) [junit4] 2> 825646 T2115 oasc.CorePropertiesLocator.discover Looking f= or core definitions underneath /usr/home/hudson/hudson-slave/workspace/Luce= ne-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cl= oud.CollectionsAPIDistributedZkTest-jetty1-1375542115917 [junit4] 2> 825649 T2115 oasc.CorePropertiesLocator.discoverUnder Foun= d core conf in /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-tr= unk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsA= PIDistributedZkTest-jetty1-1375542115917/conf/ [junit4] 2> 825850 T2115 oasc.CorePropertiesLocator.discover Found 1 c= ore definitions [junit4] 2> 825852 T2115 oass.SolrDispatchFilter.init user.dir=3D/usr/= home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build= /solr-core/test/J1 [junit4] 2> 825852 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() done [junit4] 2> 825853 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D128&maxConnectionsPerHost=3D32&foll= owRedirects=3Dfalse [junit4] 2> 826163 T2115 oejs.Server.doStart jetty-8.1.10.v20130312 [junit4] 2> 826167 T2115 oejs.AbstractConnector.doStart Started Socket= Connector@127.0.0.1:22940 [junit4] 2> 826168 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() [junit4] 2> 826168 T2115 oasc.SolrResourceLoader.locateSolrHome JNDI n= ot configured for solr (NoInitialContextEx) [junit4] 2> 826169 T2115 oasc.SolrResourceLoader.locateSolrHome using = system property solr.solr.home: /usr/home/hudson/hudson-slave/workspace/Luc= ene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.c= loud.CollectionsAPIDistributedZkTest-jetty2-1375542117652 [junit4] 2> 826169 T2115 oasc.SolrResourceLoader. new SolrResour= ceLoader for directory: '/usr/home/hudson/hudson-slave/workspace/Lucene-Sol= r-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Co= llectionsAPIDistributedZkTest-jetty2-1375542117652/' [junit4] 2> 826213 T2115 oasc.ConfigSolr.fromFile Loading container co= nfiguration from /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-= trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Collection= sAPIDistributedZkTest-jetty2-1375542117652/solr.xml [junit4] 2> 826314 T2115 oasc.ConfigSolrXml. Config-defined core= root directory:=20 [junit4] 2> 826315 T2115 oasc.CoreContainer. New CoreContainer 2= 08878040 [junit4] 2> 826315 T2115 oasc.CoreContainer.load Loading cores into Co= reContainer [instanceDir=3D/usr/home/hudson/hudson-slave/workspace/Lucene-S= olr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.= CollectionsAPIDistributedZkTest-jetty2-1375542117652/] [junit4] 2> 826317 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting socketTimeout to: 120000 [junit4] 2> 826318 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting urlScheme to: http:// [junit4] 2> 826318 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting connTimeout to: 15000 [junit4] 2> 826319 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxConnectionsPerHost to: 20 [junit4] 2> 826319 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting corePoolSize to: 0 [junit4] 2> 826320 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maximumPoolSize to: 2147483647 [junit4] 2> 826320 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxThreadIdleTime to: 5 [junit4] 2> 826321 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting sizeOfQueue to: -1 [junit4] 2> 826321 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting fairnessPolicy to: false [junit4] 2> 826322 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnectionsPerHost=3D20&maxConnections=3D10000&so= cketTimeout=3D120000&connTimeout=3D15000&retry=3Dfalse [junit4] 2> 826340 T2115 oasc.ZkContainer.initZooKeeper Zookeeper clie= nt=3D127.0.0.1:22930/solr [junit4] 2> 826340 T2115 oasc.ZkController.checkChrootPath zkHost incl= udes chroot [junit4] 2> 826341 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 826344 T2167 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@5b597106 name:ZooKeeperConnection= Watcher:127.0.0.1:22930 got event WatchedEvent state:SyncConnected type:No= ne path:null path:null type:None [junit4] 2> 826344 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 826347 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D500&maxConnectionsPerHost=3D16&sock= etTimeout=3D120000&connTimeout=3D15000 [junit4] 2> 826360 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 826362 T2169 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@15f2b91a name:ZooKeeperConnection= Watcher:127.0.0.1:22930/solr got event WatchedEvent state:SyncConnected ty= pe:None path:null path:null type:None [junit4] 2> 826362 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 826373 T2115 oascc.ZkStateReader.createClusterStateWatcher= sAndUpdate Updating cluster state from ZooKeeper...=20 [junit4] 2> 827376 T2115 oasc.ZkController.createEphemeralLiveNode Reg= ister node as live in ZooKeeper:/live_nodes/127.0.0.1:22940_ [junit4] 2> 827384 T2115 oascc.SolrZkClient.makePath makePath: /live_n= odes/127.0.0.1:22940_ [junit4] 2> 827387 T2155 oascc.ZkStateReader$3.process Updating live n= odes... (3) [junit4] 2> 827388 T2142 oascc.ZkStateReader$3.process Updating live n= odes... (3) [junit4] 2> 827388 T2137 oascc.ZkStateReader$3.process Updating live n= odes... (3) [junit4] 2> 827388 T2169 oascc.ZkStateReader$3.process Updating live n= odes... (3) [junit4] 2> 827402 T2115 oasc.CorePropertiesLocator.discover Looking f= or core definitions underneath /usr/home/hudson/hudson-slave/workspace/Luce= ne-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cl= oud.CollectionsAPIDistributedZkTest-jetty2-1375542117652 [junit4] 2> 827580 T2115 oasc.CorePropertiesLocator.discoverUnder Foun= d core conf in /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-tr= unk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsA= PIDistributedZkTest-jetty2-1375542117652/conf/ [junit4] 2> 827587 T2115 oasc.CorePropertiesLocator.discover Found 1 c= ore definitions [junit4] 2> 827588 T2115 oass.SolrDispatchFilter.init user.dir=3D/usr/= home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build= /solr-core/test/J1 [junit4] 2> 827588 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() done [junit4] 2> 827589 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D128&maxConnectionsPerHost=3D32&foll= owRedirects=3Dfalse [junit4] 2> 827887 T2115 oejs.Server.doStart jetty-8.1.10.v20130312 [junit4] 2> 827890 T2115 oejs.AbstractConnector.doStart Started Socket= Connector@127.0.0.1:22943 [junit4] 2> 827891 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() [junit4] 2> 827892 T2115 oasc.SolrResourceLoader.locateSolrHome JNDI n= ot configured for solr (NoInitialContextEx) [junit4] 2> 827892 T2115 oasc.SolrResourceLoader.locateSolrHome using = system property solr.solr.home: /usr/home/hudson/hudson-slave/workspace/Luc= ene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.c= loud.CollectionsAPIDistributedZkTest-jetty3-1375542119385 [junit4] 2> 827893 T2115 oasc.SolrResourceLoader. new SolrResour= ceLoader for directory: '/usr/home/hudson/hudson-slave/workspace/Lucene-Sol= r-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Co= llectionsAPIDistributedZkTest-jetty3-1375542119385/' [junit4] 2> 827933 T2115 oasc.ConfigSolr.fromFile Loading container co= nfiguration from /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-= trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Collection= sAPIDistributedZkTest-jetty3-1375542119385/solr.xml [junit4] 2> 828025 T2115 oasc.ConfigSolrXml. Config-defined core= root directory:=20 [junit4] 2> 828026 T2115 oasc.CoreContainer. New CoreContainer 3= 33352415 [junit4] 2> 828026 T2115 oasc.CoreContainer.load Loading cores into Co= reContainer [instanceDir=3D/usr/home/hudson/hudson-slave/workspace/Lucene-S= olr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.= CollectionsAPIDistributedZkTest-jetty3-1375542119385/] [junit4] 2> 828028 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting socketTimeout to: 120000 [junit4] 2> 828029 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting urlScheme to: http:// [junit4] 2> 828029 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting connTimeout to: 15000 [junit4] 2> 828030 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxConnectionsPerHost to: 20 [junit4] 2> 828030 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting corePoolSize to: 0 [junit4] 2> 828031 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maximumPoolSize to: 2147483647 [junit4] 2> 828031 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxThreadIdleTime to: 5 [junit4] 2> 828032 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting sizeOfQueue to: -1 [junit4] 2> 828032 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting fairnessPolicy to: false [junit4] 2> 828033 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnectionsPerHost=3D20&maxConnections=3D10000&so= cketTimeout=3D120000&connTimeout=3D15000&retry=3Dfalse [junit4] 2> 828049 T2115 oasc.ZkContainer.initZooKeeper Zookeeper clie= nt=3D127.0.0.1:22930/solr [junit4] 2> 828050 T2115 oasc.ZkController.checkChrootPath zkHost incl= udes chroot [junit4] 2> 828052 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 828057 T2181 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@ef1ad77 name:ZooKeeperConnection = Watcher:127.0.0.1:22930 got event WatchedEvent state:SyncConnected type:Non= e path:null path:null type:None [junit4] 2> 828057 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 828061 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D500&maxConnectionsPerHost=3D16&sock= etTimeout=3D120000&connTimeout=3D15000 [junit4] 2> 828072 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 828074 T2183 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@1033c7d name:ZooKeeperConnection = Watcher:127.0.0.1:22930/solr got event WatchedEvent state:SyncConnected typ= e:None path:null path:null type:None [junit4] 2> 828074 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 828086 T2115 oascc.ZkStateReader.createClusterStateWatcher= sAndUpdate Updating cluster state from ZooKeeper...=20 [junit4] 2> 829089 T2115 oasc.ZkController.createEphemeralLiveNode Reg= ister node as live in ZooKeeper:/live_nodes/127.0.0.1:22943_ [junit4] 2> 829092 T2115 oascc.SolrZkClient.makePath makePath: /live_n= odes/127.0.0.1:22943_ [junit4] 2> 829095 T2169 oascc.ZkStateReader$3.process Updating live n= odes... (4) [junit4] 2> 829096 T2142 oascc.ZkStateReader$3.process Updating live n= odes... (4) [junit4] 2> 829096 T2137 oascc.ZkStateReader$3.process Updating live n= odes... (4) [junit4] 2> 829096 T2183 oascc.ZkStateReader$3.process Updating live n= odes... (4) [junit4] 2> 829095 T2155 oascc.ZkStateReader$3.process Updating live n= odes... (4) [junit4] 2> 829113 T2115 oasc.CorePropertiesLocator.discover Looking f= or core definitions underneath /usr/home/hudson/hudson-slave/workspace/Luce= ne-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cl= oud.CollectionsAPIDistributedZkTest-jetty3-1375542119385 [junit4] 2> 829313 T2115 oasc.CorePropertiesLocator.discoverUnder Foun= d core conf in /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-tr= unk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsA= PIDistributedZkTest-jetty3-1375542119385/conf/ [junit4] 2> 829317 T2115 oasc.CorePropertiesLocator.discover Found 1 c= ore definitions [junit4] 2> 829317 T2115 oass.SolrDispatchFilter.init user.dir=3D/usr/= home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build= /solr-core/test/J1 [junit4] 2> 829318 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() done [junit4] 2> 829318 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D128&maxConnectionsPerHost=3D32&foll= owRedirects=3Dfalse [junit4] 2> 829637 T2115 oejs.Server.doStart jetty-8.1.10.v20130312 [junit4] 2> 829641 T2115 oejs.AbstractConnector.doStart Started Socket= Connector@127.0.0.1:16058 [junit4] 2> 829641 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() [junit4] 2> 829642 T2115 oasc.SolrResourceLoader.locateSolrHome JNDI n= ot configured for solr (NoInitialContextEx) [junit4] 2> 829642 T2115 oasc.SolrResourceLoader.locateSolrHome using = system property solr.solr.home: /usr/home/hudson/hudson-slave/workspace/Luc= ene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.c= loud.CollectionsAPIDistributedZkTest-jetty4-1375542121117 [junit4] 2> 829643 T2115 oasc.SolrResourceLoader. new SolrResour= ceLoader for directory: '/usr/home/hudson/hudson-slave/workspace/Lucene-Sol= r-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Co= llectionsAPIDistributedZkTest-jetty4-1375542121117/' [junit4] 2> 829685 T2115 oasc.ConfigSolr.fromFile Loading container co= nfiguration from /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-= trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Collection= sAPIDistributedZkTest-jetty4-1375542121117/solr.xml [junit4] 2> 829777 T2115 oasc.ConfigSolrXml. Config-defined core= root directory:=20 [junit4] 2> 829778 T2115 oasc.CoreContainer. New CoreContainer 1= 512990020 [junit4] 2> 829778 T2115 oasc.CoreContainer.load Loading cores into Co= reContainer [instanceDir=3D/usr/home/hudson/hudson-slave/workspace/Lucene-S= olr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.= CollectionsAPIDistributedZkTest-jetty4-1375542121117/] [junit4] 2> 829781 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting socketTimeout to: 120000 [junit4] 2> 829781 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting urlScheme to: http:// [junit4] 2> 829782 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting connTimeout to: 15000 [junit4] 2> 829782 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxConnectionsPerHost to: 20 [junit4] 2> 829783 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting corePoolSize to: 0 [junit4] 2> 829783 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maximumPoolSize to: 2147483647 [junit4] 2> 829784 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting maxThreadIdleTime to: 5 [junit4] 2> 829784 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting sizeOfQueue to: -1 [junit4] 2> 829785 T2115 oashc.HttpShardHandlerFactory.getParameter Se= tting fairnessPolicy to: false [junit4] 2> 829785 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnectionsPerHost=3D20&maxConnections=3D10000&so= cketTimeout=3D120000&connTimeout=3D15000&retry=3Dfalse [junit4] 2> 829802 T2115 oasc.ZkContainer.initZooKeeper Zookeeper clie= nt=3D127.0.0.1:22930/solr [junit4] 2> 829803 T2115 oasc.ZkController.checkChrootPath zkHost incl= udes chroot [junit4] 2> 829804 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 829832 T2195 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@451dbab3 name:ZooKeeperConnection= Watcher:127.0.0.1:22930 got event WatchedEvent state:SyncConnected type:No= ne path:null path:null type:None [junit4] 2> 829832 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 829835 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D500&maxConnectionsPerHost=3D16&sock= etTimeout=3D120000&connTimeout=3D15000 [junit4] 2> 829846 T2115 oascc.ConnectionManager.waitForConnected Wait= ing for client to connect to ZooKeeper [junit4] 2> 829848 T2197 oascc.ConnectionManager.process Watcher org.a= pache.solr.common.cloud.ConnectionManager@dd8901e name:ZooKeeperConnection = Watcher:127.0.0.1:22930/solr got event WatchedEvent state:SyncConnected typ= e:None path:null path:null type:None [junit4] 2> 829848 T2115 oascc.ConnectionManager.waitForConnected Clie= nt is connected to ZooKeeper [junit4] 2> 829860 T2115 oascc.ZkStateReader.createClusterStateWatcher= sAndUpdate Updating cluster state from ZooKeeper...=20 [junit4] 2> 830864 T2115 oasc.ZkController.createEphemeralLiveNode Reg= ister node as live in ZooKeeper:/live_nodes/127.0.0.1:16058_ [junit4] 2> 830869 T2115 oascc.SolrZkClient.makePath makePath: /live_n= odes/127.0.0.1:16058_ [junit4] 2> 830874 T2169 oascc.ZkStateReader$3.process Updating live n= odes... (5) [junit4] 2> 830874 T2183 oascc.ZkStateReader$3.process Updating live n= odes... (5) [junit4] 2> 830874 T2197 oascc.ZkStateReader$3.process Updating live n= odes... (5) [junit4] 2> 830874 T2142 oascc.ZkStateReader$3.process Updating live n= odes... (5) [junit4] 2> 830874 T2137 oascc.ZkStateReader$3.process Updating live n= odes... (5) [junit4] 2> 830874 T2155 oascc.ZkStateReader$3.process Updating live n= odes... (5) [junit4] 2> 830889 T2115 oasc.CorePropertiesLocator.discover Looking f= or core definitions underneath /usr/home/hudson/hudson-slave/workspace/Luce= ne-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cl= oud.CollectionsAPIDistributedZkTest-jetty4-1375542121117 [junit4] 2> 830892 T2115 oasc.CorePropertiesLocator.discoverUnder Foun= d core conf in /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-tr= unk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsA= PIDistributedZkTest-jetty4-1375542121117/conf/ [junit4] 2> 831083 T2115 oasc.CorePropertiesLocator.discover Found 1 c= ore definitions [junit4] 2> 831084 T2115 oass.SolrDispatchFilter.init user.dir=3D/usr/= home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build= /solr-core/test/J1 [junit4] 2> 831085 T2115 oass.SolrDispatchFilter.init SolrDispatchFilt= er.init() done [junit4] 2> 831085 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D128&maxConnectionsPerHost=3D32&foll= owRedirects=3Dfalse [junit4] 2> 831102 T2115 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D128&maxConnectionsPerHost=3D32&foll= owRedirects=3Dfalse [junit4] 2> 831114 T2145 oasha.CollectionsHandler.handleCreateAction C= reating Collection : numShards=3D2&name=3Dnodes_used_collection&replication= Factor=3D2&action=3DCREATE&wt=3Djavabin&version=3D2 [junit4] 2> 831116 T2137 oasc.DistributedQueue$LatchChildWatcher.proce= ss Watcher fired on path: /overseer/collection-queue-work state: SyncConnec= ted type NodeChildrenChanged [junit4] 2> 831118 T2139 oasc.OverseerCollectionProcessor.run Overseer= Collection Processor: Get the message id:/overseer/collection-queue-work/q= n-0000000000 message:{ [junit4] 2> =09 "operation":"createcollection", [junit4] 2> =09 "numShards":"2", [junit4] 2> =09 "name":"nodes_used_collection", [junit4] 2> =09 "replicationFactor":"2"} [junit4] 2> 831118 T2139 oasc.OverseerCollectionProcessor.processMessa= ge WARN OverseerCollectionProcessor.processMessage : createcollection , { [junit4] 2> =09 "operation":"createcollection", [junit4] 2> =09 "numShards":"2", [junit4] 2> =09 "name":"nodes_used_collection", [junit4] 2> =09 "replicationFactor":"2"} [junit4] 2> 831435 T2138 oascc.ZkStateReader.updateClusterState Updati= ng cloud state from ZooKeeper...=20 [junit4] 2> 831436 T2138 oasc.Overseer$ClusterStateUpdater.buildCollec= tion building a new collection: nodes_used_collection [junit4] 2> 831436 T2138 oasc.Overseer$ClusterStateUpdater.createColle= ction Create collection nodes_used_collection with shards [shard1, shard2] [junit4] 2> 831450 T2155 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 831450 T2197 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 831450 T2142 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 831450 T2137 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 831450 T2183 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 831450 T2169 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 831538 T2139 oasc.OverseerCollectionProcessor.createCollec= tion going to create cores replicas shardNames [shard1, shard2] , repFactor= : 2 [junit4] 2> 831538 T2139 oasc.OverseerCollectionProcessor.createCollec= tion Creating shard nodes_used_collection_shard1_replica1 as part of slice = shard1 of collection nodes_used_collection on 127.0.0.1:22937_ [junit4] 2> 831539 T2139 oasc.OverseerCollectionProcessor.createCollec= tion Creating shard nodes_used_collection_shard1_replica2 as part of slice = shard1 of collection nodes_used_collection on 127.0.0.1:22933_ [junit4] 2> 831540 T2139 oasc.OverseerCollectionProcessor.createCollec= tion Creating shard nodes_used_collection_shard2_replica1 as part of slice = shard2 of collection nodes_used_collection on 127.0.0.1:16058_ [junit4] 2> 831541 T2139 oasc.OverseerCollectionProcessor.createCollec= tion Creating shard nodes_used_collection_shard2_replica2 as part of slice = shard2 of collection nodes_used_collection on 127.0.0.1:22943_ [junit4] 2> 831544 T2146 oasc.ZkController.publish publishing core=3Dn= odes_used_collection_shard1_replica1 state=3Ddown [junit4] 2> 831545 T2173 oasc.ZkController.publish publishing core=3Dn= odes_used_collection_shard2_replica2 state=3Ddown [junit4] 2> 831544 T2187 oasc.ZkController.publish publishing core=3Dn= odes_used_collection_shard2_replica1 state=3Ddown [junit4] 2> 831544 T2127 oasc.ZkController.publish publishing core=3Dn= odes_used_collection_shard1_replica2 state=3Ddown [junit4] 2> 831547 T2146 oasc.ZkController.waitForCoreNodeName look fo= r our core node name [junit4] 2> 831547 T2173 oasc.ZkController.waitForCoreNodeName look fo= r our core node name [junit4] 2> 831547 T2187 oasc.ZkController.waitForCoreNodeName look fo= r our core node name [junit4] 2> 831558 T2127 oasc.ZkController.waitForCoreNodeName look fo= r our core node name [junit4] 2> 832956 T2138 oascc.ZkStateReader.updateClusterState Updati= ng cloud state from ZooKeeper...=20 [junit4] 2> 832958 T2138 oasc.Overseer$ClusterStateUpdater.updateState= WARN Could not find collection node for nodes_used_collection, skipping pu= blish state [junit4] 2> 832958 T2138 oasc.Overseer$ClusterStateUpdater.updateState= Update state numShards=3D2 message=3D{ [junit4] 2> =09 "operation":"state", [junit4] 2> =09 "core_node_name":"core_node1", [junit4] 2> =09 "numShards":"2", [junit4] 2> =09 "shard":"shard1", [junit4] 2> =09 "roles":null, [junit4] 2> =09 "state":"down", [junit4] 2> =09 "shard_state":"active", [junit4] 2> =09 "core":"nodes_used_collection_shard1_replica1", [junit4] 2> =09 "collection":"nodes_used_collection", [junit4] 2> =09 "shard_range":null, [junit4] 2> =09 "node_name":"127.0.0.1:22937_", [junit4] 2> =09 "base_url":"http://127.0.0.1:22937"} [junit4] 2> 832968 T2138 oasc.Overseer$ClusterStateUpdater.updateState= WARN Could not find collection node for nodes_used_collection, skipping pu= blish state [junit4] 2> 832968 T2138 oasc.Overseer$ClusterStateUpdater.updateState= Update state numShards=3D2 message=3D{ [junit4] 2> =09 "operation":"state", [junit4] 2> =09 "core_node_name":"core_node2", [junit4] 2> =09 "numShards":"2", [junit4] 2> =09 "shard":"shard2", [junit4] 2> =09 "roles":null, [junit4] 2> =09 "state":"down", [junit4] 2> =09 "shard_state":"active", [junit4] 2> =09 "core":"nodes_used_collection_shard2_replica2", [junit4] 2> =09 "collection":"nodes_used_collection", [junit4] 2> =09 "shard_range":null, [junit4] 2> =09 "node_name":"127.0.0.1:22943_", [junit4] 2> =09 "base_url":"http://127.0.0.1:22943"} [junit4] 2> 832988 T2138 oasc.Overseer$ClusterStateUpdater.updateState= WARN Could not find collection node for nodes_used_collection, skipping pu= blish state [junit4] 2> 832988 T2138 oasc.Overseer$ClusterStateUpdater.updateState= Update state numShards=3D2 message=3D{ [junit4] 2> =09 "operation":"state", [junit4] 2> =09 "core_node_name":"core_node3", [junit4] 2> =09 "numShards":"2", [junit4] 2> =09 "shard":"shard2", [junit4] 2> =09 "roles":null, [junit4] 2> =09 "state":"down", [junit4] 2> =09 "shard_state":"active", [junit4] 2> =09 "core":"nodes_used_collection_shard2_replica1", [junit4] 2> =09 "collection":"nodes_used_collection", [junit4] 2> =09 "shard_range":null, [junit4] 2> =09 "node_name":"127.0.0.1:16058_", [junit4] 2> =09 "base_url":"http://127.0.0.1:16058"} [junit4] 2> 833001 T2138 oasc.Overseer$ClusterStateUpdater.updateState= WARN Could not find collection node for nodes_used_collection, skipping pu= blish state [junit4] 2> 833001 T2138 oasc.Overseer$ClusterStateUpdater.updateState= Update state numShards=3D2 message=3D{ [junit4] 2> =09 "operation":"state", [junit4] 2> =09 "core_node_name":"core_node4", [junit4] 2> =09 "numShards":"2", [junit4] 2> =09 "shard":"shard1", [junit4] 2> =09 "roles":null, [junit4] 2> =09 "state":"down", [junit4] 2> =09 "shard_state":"active", [junit4] 2> =09 "core":"nodes_used_collection_shard1_replica2", [junit4] 2> =09 "collection":"nodes_used_collection", [junit4] 2> =09 "shard_range":null, [junit4] 2> =09 "node_name":"127.0.0.1:22933_", [junit4] 2> =09 "base_url":"http://127.0.0.1:22933"} [junit4] 2> 833023 T2169 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 833023 T2142 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 833023 T2197 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 833023 T2183 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 833023 T2137 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 833023 T2155 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeDataChanged path:/cluste= rstate.json, has occurred - updating... (live nodes size: 5) [junit4] 2> 833549 T2146 oasc.ZkController.waitForShardId waiting to f= ind shard id in clusterstate for nodes_used_collection_shard1_replica1 [junit4] 2> 833549 T2173 oasc.ZkController.waitForShardId waiting to f= ind shard id in clusterstate for nodes_used_collection_shard2_replica2 [junit4] 2> 833550 T2187 oasc.ZkController.waitForShardId waiting to f= ind shard id in clusterstate for nodes_used_collection_shard2_replica1 [junit4] 2> 833550 T2146 oasc.CorePropertiesLocator.writePropertiesFil= e ERROR Couldn't persist core properties to /usr/home/hudson/hudson-slave/w= orkspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.a= pache.solr.cloud.CollectionsAPIDistributedZkTest-jetty1-1375542115917/nodes= _used_collection_shard1_replica1/core.properties: java.io.FileNotFoundExcep= tion: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7= /solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistrib= utedZkTest-jetty1-1375542115917/nodes_used_collection_shard1_replica1/core.= properties (No such file or directory) [junit4] 2> 833551 T2146 oasc.CoreContainer.create Creating SolrCore '= nodes_used_collection_shard1_replica1' using instanceDir: /usr/home/hudson/= hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/t= est/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty1-13755= 42115917/nodes_used_collection_shard1_replica1 [junit4] 2> 833551 T2146 oasc.ZkController.createCollectionZkNode Chec= k for collection zkNode:nodes_used_collection [junit4] 2> 833551 T2173 oasc.CorePropertiesLocator.writePropertiesFil= e ERROR Couldn't persist core properties to /usr/home/hudson/hudson-slave/w= orkspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.a= pache.solr.cloud.CollectionsAPIDistributedZkTest-jetty3-1375542119385/nodes= _used_collection_shard2_replica2/core.properties: java.io.FileNotFoundExcep= tion: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7= /solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistrib= utedZkTest-jetty3-1375542119385/nodes_used_collection_shard2_replica2/core.= properties (No such file or directory) [junit4] 2> 833551 T2187 oasc.CorePropertiesLocator.writePropertiesFil= e ERROR Couldn't persist core properties to /usr/home/hudson/hudson-slave/w= orkspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.a= pache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1375542121117/nodes= _used_collection_shard2_replica1/core.properties: java.io.FileNotFoundExcep= tion: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7= /solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDistrib= utedZkTest-jetty4-1375542121117/nodes_used_collection_shard2_replica1/core.= properties (No such file or directory) [junit4] 2> 833552 T2146 oasc.ZkController.createCollectionZkNode Crea= ting collection in ZooKeeper:nodes_used_collection [junit4] 2> 833552 T2173 oasc.CoreContainer.create Creating SolrCore '= nodes_used_collection_shard2_replica2' using instanceDir: /usr/home/hudson/= hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/t= est/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty3-13755= 42119385/nodes_used_collection_shard2_replica2 [junit4] 2> 833553 T2146 oasc.ZkController.getConfName Looking for col= lection configName [junit4] 2> 833552 T2187 oasc.CoreContainer.create Creating SolrCore '= nodes_used_collection_shard2_replica1' using instanceDir: /usr/home/hudson/= hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/t= est/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-13755= 42121117/nodes_used_collection_shard2_replica1 [junit4] 2> 833553 T2173 oasc.ZkController.createCollectionZkNode Chec= k for collection zkNode:nodes_used_collection [junit4] 2> 833554 T2187 oasc.ZkController.createCollectionZkNode Chec= k for collection zkNode:nodes_used_collection [junit4] 2> 833554 T2146 oasc.ZkController.getConfName Only one config= set found in zk - using it:conf1 [junit4] 2> 833554 T2173 oasc.ZkController.createCollectionZkNode Crea= ting collection in ZooKeeper:nodes_used_collection [junit4] 2> 833555 T2187 oasc.ZkController.createCollectionZkNode Crea= ting collection in ZooKeeper:nodes_used_collection [junit4] 2> 833555 T2146 oascc.SolrZkClient.makePath makePath: /collec= tions/nodes_used_collection [junit4] 2> 833555 T2187 oasc.ZkController.getConfName Looking for col= lection configName [junit4] 2> 833555 T2173 oasc.ZkController.getConfName Looking for col= lection configName [junit4] 2> 833557 T2187 oasc.ZkController.getConfName Only one config= set found in zk - using it:conf1 [junit4] 2> 833557 T2187 oascc.SolrZkClient.makePath makePath: /collec= tions/nodes_used_collection [junit4] 2> 833560 T2127 oasc.ZkController.waitForShardId waiting to f= ind shard id in clusterstate for nodes_used_collection_shard1_replica2 [junit4] 2> 833561 T2127 oasc.CorePropertiesLocator.writePropertiesFil= e ERROR Couldn't persist core properties to /usr/home/hudson/hudson-slave/w= orkspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.a= pache.solr.cloud.CollectionsAPIDistributedZkTest-controljetty-1375542115112= /nodes_used_collection_shard1_replica2/core.properties: java.io.FileNotFoun= dException: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk= -Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPID= istributedZkTest-controljetty-1375542115112/nodes_used_collection_shard1_re= plica2/core.properties (No such file or directory) [junit4] 2> 833561 T2127 oasc.CoreContainer.create Creating SolrCore '= nodes_used_collection_shard1_replica2' using instanceDir: /usr/home/hudson/= hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/t= est/J1/./org.apache.solr.cloud.CollectionsAPIDistributedZkTest-controljetty= -1375542115112/nodes_used_collection_shard1_replica2 [junit4] 2> 833562 T2127 oasc.ZkController.createCollectionZkNode Chec= k for collection zkNode:nodes_used_collection [junit4] 2> 833567 T2173 oasc.ZkController.getConfName Only one config= set found in zk - using it:conf1 [junit4] 2> 833567 T2146 oasc.ZkController.readConfigName Load collect= ion config from:/collections/nodes_used_collection [junit4] 2> 833567 T2127 oasc.ZkController.createCollectionZkNode Coll= ection zkNode exists [junit4] 2> 833568 T2127 oasc.ZkController.readConfigName Load collect= ion config from:/collections/nodes_used_collection [junit4] 2> 833568 T2173 oascc.SolrZkClient.makePath makePath: /collec= tions/nodes_used_collection [junit4] 2> 833569 T2187 oasc.ZkController.readConfigName Load collect= ion config from:/collections/nodes_used_collection [junit4] 2> 833569 T2146 oasc.SolrResourceLoader. new SolrResour= ceLoader for directory: '/usr/home/hudson/hudson-slave/workspace/Lucene-Sol= r-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Co= llectionsAPIDistributedZkTest-jetty1-1375542115917/nodes_used_collection_sh= ard1_replica1/' [junit4] 2> 833570 T2127 oasc.SolrResourceLoader. new SolrResour= ceLoader for directory: '/usr/home/hudson/hudson-slave/workspace/Lucene-Sol= r-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Co= llectionsAPIDistributedZkTest-controljetty-1375542115112/nodes_used_collect= ion_shard1_replica2/' [junit4] 2> 833571 T2173 oasc.ZkController.readConfigName Load collect= ion config from:/collections/nodes_used_collection [junit4] 2> 833571 T2187 oasc.SolrResourceLoader. new SolrResour= ceLoader for directory: '/usr/home/hudson/hudson-slave/workspace/Lucene-Sol= r-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Co= llectionsAPIDistributedZkTest-jetty4-1375542121117/nodes_used_collection_sh= ard2_replica1/' [junit4] 2> 833572 T2173 oasc.SolrResourceLoader. new SolrResour= ceLoader for directory: '/usr/home/hudson/hudson-slave/workspace/Lucene-Sol= r-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Co= llectionsAPIDistributedZkTest-jetty3-1375542119385/nodes_used_collection_sh= ard2_replica2/' [junit4] 2> 833701 T2187 oasc.SolrConfig. Using Lucene MatchVers= ion: LUCENE_50 [junit4] 2> 833701 T2173 oasc.SolrConfig. Using Lucene MatchVers= ion: LUCENE_50 [junit4] 2> 833715 T2146 oasc.SolrConfig. Using Lucene MatchVers= ion: LUCENE_50 [junit4] 2> 833715 T2127 oasc.SolrConfig. Using Lucene MatchVers= ion: LUCENE_50 [junit4] 2> 833787 T2173 oasc.SolrConfig. Loaded SolrConfig: sol= rconfig.xml [junit4] 2> 833799 T2187 oasc.SolrConfig. Loaded SolrConfig: sol= rconfig.xml [junit4] 2> 833816 T2146 oasc.SolrConfig. Loaded SolrConfig: sol= rconfig.xml [junit4] 2> 833817 T2127 oasc.SolrConfig. Loaded SolrConfig: sol= rconfig.xml [junit4] 2> 833889 T2173 oass.IndexSchema.readSchema Reading Solr Sche= ma from schema.xml [junit4] 2> 833900 T2187 oass.IndexSchema.readSchema Reading Solr Sche= ma from schema.xml [junit4] 2> 833901 T2173 oass.IndexSchema.readSchema [nodes_used_colle= ction_shard2_replica2] Schema name=3Dtest [junit4] 2> 833909 T2187 oass.IndexSchema.readSchema [nodes_used_colle= ction_shard2_replica1] Schema name=3Dtest [junit4] 2> 833918 T2146 oass.IndexSchema.readSchema Reading Solr Sche= ma from schema.xml [junit4] 2> 833918 T2127 oass.IndexSchema.readSchema Reading Solr Sche= ma from schema.xml [junit4] 2> 833931 T2146 oass.IndexSchema.readSchema [nodes_used_colle= ction_shard1_replica1] Schema name=3Dtest [junit4] 2> 833931 T2127 oass.IndexSchema.readSchema [nodes_used_colle= ction_shard1_replica2] Schema name=3Dtest [junit4] 2> 834669 T2127 oass.OpenExchangeRatesOrgProvider.init Initia= lized with rates=3Dopen-exchange-rates.json, refreshInterval=3D1440. [junit4] 2> 834669 T2187 oass.OpenExchangeRatesOrgProvider.init Initia= lized with rates=3Dopen-exchange-rates.json, refreshInterval=3D1440. [junit4] 2> 834680 T2127 oass.IndexSchema.readSchema default search fi= eld in schema is text [junit4] 2> 834681 T2187 oass.IndexSchema.readSchema default search fi= eld in schema is text [junit4] 2> 834684 T2127 oass.IndexSchema.readSchema unique key field:= id [junit4] 2> 834687 T2187 oass.IndexSchema.readSchema unique key field:= id [junit4] 2> 834697 T2127 oass.FileExchangeRateProvider.reload Reloadin= g exchange rates from file currency.xml [junit4] 2> 834700 T2187 oass.FileExchangeRateProvider.reload Reloadin= g exchange rates from file currency.xml [junit4] 2> 834701 T2127 oass.FileExchangeRateProvider.reload Reloadin= g exchange rates from file currency.xml [junit4] 2> 834706 T2187 oass.FileExchangeRateProvider.reload Reloadin= g exchange rates from file currency.xml [junit4] 2> 834706 T2127 oass.OpenExchangeRatesOrgProvider.reload Relo= ading exchange rates from open-exchange-rates.json [junit4] 2> 834708 T2127 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Unknown key IMPORTANT NOTE [junit4] 2> 834708 T2127 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Expected key, got STRING [junit4] 2> 834708 T2127 oass.OpenExchangeRatesOrgProvider.reload Relo= ading exchange rates from open-exchange-rates.json [junit4] 2> 834709 T2127 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Unknown key IMPORTANT NOTE [junit4] 2> 834710 T2127 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Expected key, got STRING [junit4] 2> 834710 T2127 oasc.SolrCore.initDirectoryFactory org.apache= .solr.core.MockDirectoryFactory [junit4] 2> 834710 T2127 oasc.SolrCore. [nodes_used_collection_s= hard1_replica2] Opening new SolrCore at /usr/home/hudson/hudson-slave/works= pace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apach= e.solr.cloud.CollectionsAPIDistributedZkTest-controljetty-1375542115112/nod= es_used_collection_shard1_replica2/, dataDir=3D/usr/home/hudson/hudson-slav= e/workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./or= g.apache.solr.cloud.CollectionsAPIDistributedZkTest-controljetty-1375542115= 112//nodes_used_collection_shard1_replica2/data/ [junit4] 2> 834711 T2127 oasc.JmxMonitoredMap. JMX monitoring is= enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBea= nServer@1ba1f28e [junit4] 2> 834712 T2187 oass.OpenExchangeRatesOrgProvider.reload Relo= ading exchange rates from open-exchange-rates.json [junit4] 2> 834712 T2127 oasc.CachingDirectoryFactory.get return new d= irectory for /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trun= k-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPI= DistributedZkTest-controljetty-1375542115112//nodes_used_collection_shard1_= replica2/data [junit4] 2> 834712 T2127 oasc.SolrCore.getNewIndexDir New index direct= ory detected: old=3Dnull new=3D/usr/home/hudson/hudson-slave/workspace/Luce= ne-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cl= oud.CollectionsAPIDistributedZkTest-controljetty-1375542115112//nodes_used_= collection_shard1_replica2/data/index/ [junit4] 2> 834713 T2127 oasc.SolrCore.initIndex WARN [nodes_used_coll= ection_shard1_replica2] Solr index directory '/usr/home/hudson/hudson-slave= /workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org= .apache.solr.cloud.CollectionsAPIDistributedZkTest-controljetty-13755421151= 12/nodes_used_collection_shard1_replica2/data/index' doesn't exist. Creatin= g new index... [junit4] 2> 834713 T2187 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Unknown key IMPORTANT NOTE [junit4] 2> 834713 T2127 oasc.CachingDirectoryFactory.get return new d= irectory for /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trun= k-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPI= DistributedZkTest-controljetty-1375542115112//nodes_used_collection_shard1_= replica2/data/index [junit4] 2> 834713 T2187 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Expected key, got STRING [junit4] 2> 834714 T2187 oass.OpenExchangeRatesOrgProvider.reload Relo= ading exchange rates from open-exchange-rates.json [junit4] 2> 834715 T2187 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Unknown key IMPORTANT NOTE [junit4] 2> 834716 T2187 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Expected key, got STRING [junit4] 2> 834716 T2187 oasc.SolrCore.initDirectoryFactory org.apache= .solr.core.MockDirectoryFactory [junit4] 2> 834717 T2187 oasc.SolrCore. [nodes_used_collection_s= hard2_replica1] Opening new SolrCore at /usr/home/hudson/hudson-slave/works= pace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apach= e.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1375542121117/nodes_use= d_collection_shard2_replica1/, dataDir=3D/usr/home/hudson/hudson-slave/work= space/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apac= he.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1375542121117//nodes_u= sed_collection_shard2_replica1/data/ [junit4] 2> 834717 T2187 oasc.JmxMonitoredMap. JMX monitoring is= enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBea= nServer@1ba1f28e [junit4] 2> 834718 T2127 oasc.SolrDeletionPolicy.onCommit SolrDeletion= Policy.onCommit: commits: num=3D1 [junit4] 2> =09=09commit{dir=3DMockDirWrapper(org.apache.lucene.store.= RAMDirectory@6292a3e3 lockFactory=3Dorg.apache.lucene.store.NativeFSLockFac= tory@2629dd18),segFN=3Dsegments_1,generation=3D1} [junit4] 2> 834718 T2127 oasc.SolrDeletionPolicy.updateCommits newest = commit generation =3D 1 [junit4] 2> 834718 T2187 oasc.CachingDirectoryFactory.get return new d= irectory for /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trun= k-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPI= DistributedZkTest-jetty4-1375542121117//nodes_used_collection_shard2_replic= a1/data [junit4] 2> 834719 T2187 oasc.SolrCore.getNewIndexDir New index direct= ory detected: old=3Dnull new=3D/usr/home/hudson/hudson-slave/workspace/Luce= ne-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cl= oud.CollectionsAPIDistributedZkTest-jetty4-1375542121117//nodes_used_collec= tion_shard2_replica1/data/index/ [junit4] 2> 834719 T2187 oasc.SolrCore.initIndex WARN [nodes_used_coll= ection_shard2_replica1] Solr index directory '/usr/home/hudson/hudson-slave= /workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org= .apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty4-1375542121117/nod= es_used_collection_shard2_replica1/data/index' doesn't exist. Creating new = index... [junit4] 2> 834720 T2187 oasc.CachingDirectoryFactory.get return new d= irectory for /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trun= k-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPI= DistributedZkTest-jetty4-1375542121117//nodes_used_collection_shard2_replic= a1/data/index [junit4] 2> 834723 T2127 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "ded= upe" [junit4] 2> 834723 T2127 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "sto= red_sig" [junit4] 2> 834724 T2127 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "dis= trib-dup-test-chain-implicit" [junit4] 2> 834725 T2127 oasc.RequestHandlers.initHandlersFromConfig c= reated standard: solr.StandardRequestHandler [junit4] 2> 834725 T2127 oasc.RequestHandlers.initHandlersFromConfig c= reated /get: solr.RealTimeGetHandler [junit4] 2> 834726 T2127 oasc.RequestHandlers.initHandlersFromConfig a= dding lazy requestHandler: solr.ReplicationHandler [junit4] 2> 834726 T2127 oasc.RequestHandlers.initHandlersFromConfig c= reated /replication: solr.ReplicationHandler [junit4] 2> 834726 T2187 oasc.SolrDeletionPolicy.onCommit SolrDeletion= Policy.onCommit: commits: num=3D1 [junit4] 2> =09=09commit{dir=3DMockDirWrapper(org.apache.lucene.store.= RAMDirectory@1117b2b0 lockFactory=3Dorg.apache.lucene.store.NativeFSLockFac= tory@31df042a),segFN=3Dsegments_1,generation=3D1} [junit4] 2> 834726 T2127 oasc.RequestHandlers.initHandlersFromConfig c= reated /update: solr.UpdateRequestHandler [junit4] 2> 834727 T2187 oasc.SolrDeletionPolicy.updateCommits newest = commit generation =3D 1 [junit4] 2> 834727 T2127 oasc.RequestHandlers.initHandlersFromConfig c= reated /admin/: org.apache.solr.handler.admin.AdminHandlers [junit4] 2> 834728 T2146 oass.OpenExchangeRatesOrgProvider.init Initia= lized with rates=3Dopen-exchange-rates.json, refreshInterval=3D1440. [junit4] 2> 834734 T2187 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "ded= upe" [junit4] 2> 834734 T2187 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "sto= red_sig" [junit4] 2> 834735 T2187 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "dis= trib-dup-test-chain-implicit" [junit4] 2> 834736 T2187 oasc.RequestHandlers.initHandlersFromConfig c= reated standard: solr.StandardRequestHandler [junit4] 2> 834737 T2187 oasc.RequestHandlers.initHandlersFromConfig c= reated /get: solr.RealTimeGetHandler [junit4] 2> 834737 T2187 oasc.RequestHandlers.initHandlersFromConfig a= dding lazy requestHandler: solr.ReplicationHandler [junit4] 2> 834738 T2187 oasc.RequestHandlers.initHandlersFromConfig c= reated /replication: solr.ReplicationHandler [junit4] 2> 834739 T2187 oasc.RequestHandlers.initHandlersFromConfig c= reated /update: solr.UpdateRequestHandler [junit4] 2> 834739 T2187 oasc.RequestHandlers.initHandlersFromConfig c= reated /admin/: org.apache.solr.handler.admin.AdminHandlers [junit4] 2> 834749 T2127 oashl.XMLLoader.init xsltCacheLifetimeSeconds= =3D60 [junit4] 2> 834749 T2187 oashl.XMLLoader.init xsltCacheLifetimeSeconds= =3D60 [junit4] 2> 834751 T2146 oass.IndexSchema.readSchema default search fi= eld in schema is text [junit4] 2> 834752 T2127 oass.SolrIndexSearcher. Opening Searche= r@5ea2a935 main [junit4] 2> 834753 T2187 oass.SolrIndexSearcher. Opening Searche= r@4b21f9cc main [junit4] 2> 834754 T2127 oasu.CommitTracker. Hard AutoCommit: di= sabled [junit4] 2> 834754 T2127 oasu.CommitTracker. Soft AutoCommit: di= sabled [junit4] 2> 834755 T2187 oasu.CommitTracker. Hard AutoCommit: di= sabled [junit4] 2> 834756 T2187 oasu.CommitTracker. Soft AutoCommit: di= sabled [junit4] 2> 834756 T2146 oass.IndexSchema.readSchema unique key field:= id [junit4] 2> 834758 T2203 oasc.SolrCore.registerSearcher [nodes_used_co= llection_shard1_replica2] Registered new searcher Searcher@5ea2a935 main{St= andardDirectoryReader(segments_1:1)} [junit4] 2> 834759 T2127 oasc.CoreContainer.registerCore registering c= ore: nodes_used_collection_shard1_replica2 [junit4] 2> 834760 T2127 oasc.ZkController.register Register replica -= core:nodes_used_collection_shard1_replica2 address:http://127.0.0.1:22933 = collection:nodes_used_collection shard:shard1 [junit4] 2> 834760 T2204 oasc.SolrCore.registerSearcher [nodes_used_co= llection_shard2_replica1] Registered new searcher Searcher@4b21f9cc main{St= andardDirectoryReader(segments_1:1)} [junit4] 2> 834760 T2127 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D10000&maxConnectionsPerHost=3D20&co= nnTimeout=3D15000&socketTimeout=3D30000&retry=3Dfalse [junit4] 2> 834762 T2187 oasc.CoreContainer.registerCore registering c= ore: nodes_used_collection_shard2_replica1 [junit4] 2> 834763 T2187 oasc.ZkController.register Register replica -= core:nodes_used_collection_shard2_replica1 address:http://127.0.0.1:16058 = collection:nodes_used_collection shard:shard2 [junit4] 2> 834763 T2187 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D10000&maxConnectionsPerHost=3D20&co= nnTimeout=3D15000&socketTimeout=3D30000&retry=3Dfalse [junit4] 2> 834771 T2173 oass.OpenExchangeRatesOrgProvider.init Initia= lized with rates=3Dopen-exchange-rates.json, refreshInterval=3D1440. [junit4] 2> 834773 T2146 oass.FileExchangeRateProvider.reload Reloadin= g exchange rates from file currency.xml [junit4] 2> 834776 T2127 oascc.SolrZkClient.makePath makePath: /collec= tions/nodes_used_collection/leader_elect/shard1/election [junit4] 2> 834779 T2187 oascc.SolrZkClient.makePath makePath: /collec= tions/nodes_used_collection/leader_elect/shard2/election [junit4] 2> 834782 T2173 oass.IndexSchema.readSchema default search fi= eld in schema is text [junit4] 2> 834786 T2173 oass.IndexSchema.readSchema unique key field:= id [junit4] 2> 834797 T2127 oasc.ShardLeaderElectionContext.runLeaderProc= ess Running the leader process for shard shard1 [junit4] 2> 834797 T2146 oass.FileExchangeRateProvider.reload Reloadin= g exchange rates from file currency.xml [junit4] 2> 834810 T2187 oasc.ShardLeaderElectionContext.runLeaderProc= ess Running the leader process for shard shard2 [junit4] 2> 834811 T2127 oasc.ShardLeaderElectionContext.waitForReplic= asToComeUp Waiting until we see more replicas up for shard shard1: total=3D= 2 found=3D1 timeoutin=3D179999 [junit4] 2> 834813 T2187 oasc.ShardLeaderElectionContext.waitForReplic= asToComeUp Waiting until we see more replicas up for shard shard2: total=3D= 2 found=3D1 timeoutin=3D179999 [junit4] 2> 834813 T2146 oass.OpenExchangeRatesOrgProvider.reload Relo= ading exchange rates from open-exchange-rates.json [junit4] 2> 834815 T2146 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Unknown key IMPORTANT NOTE [junit4] 2> 834815 T2146 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Expected key, got STRING [junit4] 2> 834816 T2146 oass.OpenExchangeRatesOrgProvider.reload Relo= ading exchange rates from open-exchange-rates.json [junit4] 2> 834816 T2173 oass.FileExchangeRateProvider.reload Reloadin= g exchange rates from file currency.xml [junit4] 2> 834817 T2146 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Unknown key IMPORTANT NOTE [junit4] 2> 834817 T2146 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Expected key, got STRING [junit4] 2> 834818 T2146 oasc.SolrCore.initDirectoryFactory org.apache= .solr.core.MockDirectoryFactory [junit4] 2> 834818 T2146 oasc.SolrCore. [nodes_used_collection_s= hard1_replica1] Opening new SolrCore at /usr/home/hudson/hudson-slave/works= pace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apach= e.solr.cloud.CollectionsAPIDistributedZkTest-jetty1-1375542115917/nodes_use= d_collection_shard1_replica1/, dataDir=3D/usr/home/hudson/hudson-slave/work= space/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apac= he.solr.cloud.CollectionsAPIDistributedZkTest-jetty1-1375542115917//nodes_u= sed_collection_shard1_replica1/data/ [junit4] 2> 834819 T2146 oasc.JmxMonitoredMap. JMX monitoring is= enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBea= nServer@1ba1f28e [junit4] 2> 834820 T2146 oasc.CachingDirectoryFactory.get return new d= irectory for /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trun= k-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPI= DistributedZkTest-jetty1-1375542115917//nodes_used_collection_shard1_replic= a1/data [junit4] 2> 834821 T2173 oass.FileExchangeRateProvider.reload Reloadin= g exchange rates from file currency.xml [junit4] 2> 834821 T2146 oasc.SolrCore.getNewIndexDir New index direct= ory detected: old=3Dnull new=3D/usr/home/hudson/hudson-slave/workspace/Luce= ne-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cl= oud.CollectionsAPIDistributedZkTest-jetty1-1375542115917//nodes_used_collec= tion_shard1_replica1/data/index/ [junit4] 2> 834821 T2146 oasc.SolrCore.initIndex WARN [nodes_used_coll= ection_shard1_replica1] Solr index directory '/usr/home/hudson/hudson-slave= /workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org= .apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty1-1375542115917/nod= es_used_collection_shard1_replica1/data/index' doesn't exist. Creating new = index... [junit4] 2> 834822 T2146 oasc.CachingDirectoryFactory.get return new d= irectory for /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trun= k-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPI= DistributedZkTest-jetty1-1375542115917//nodes_used_collection_shard1_replic= a1/data/index [junit4] 2> 834825 T2173 oass.OpenExchangeRatesOrgProvider.reload Relo= ading exchange rates from open-exchange-rates.json [junit4] 2> 834826 T2173 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Unknown key IMPORTANT NOTE [junit4] 2> 834826 T2173 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Expected key, got STRING [junit4] 2> 834827 T2173 oass.OpenExchangeRatesOrgProvider.reload Relo= ading exchange rates from open-exchange-rates.json [junit4] 2> 834828 T2173 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Unknown key IMPORTANT NOTE [junit4] 2> 834828 T2146 oasc.SolrDeletionPolicy.onCommit SolrDeletion= Policy.onCommit: commits: num=3D1 [junit4] 2> =09=09commit{dir=3DMockDirWrapper(org.apache.lucene.store.= RAMDirectory@af80dfd lockFactory=3Dorg.apache.lucene.store.NativeFSLockFact= ory@5dce9f66),segFN=3Dsegments_1,generation=3D1} [junit4] 2> 834828 T2173 oass.OpenExchangeRatesOrgProvider$OpenExchang= eRates. WARN Expected key, got STRING [junit4] 2> 834829 T2146 oasc.SolrDeletionPolicy.updateCommits newest = commit generation =3D 1 [junit4] 2> 834829 T2173 oasc.SolrCore.initDirectoryFactory org.apache= .solr.core.MockDirectoryFactory [junit4] 2> 834830 T2173 oasc.SolrCore. [nodes_used_collection_s= hard2_replica2] Opening new SolrCore at /usr/home/hudson/hudson-slave/works= pace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apach= e.solr.cloud.CollectionsAPIDistributedZkTest-jetty3-1375542119385/nodes_use= d_collection_shard2_replica2/, dataDir=3D/usr/home/hudson/hudson-slave/work= space/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apac= he.solr.cloud.CollectionsAPIDistributedZkTest-jetty3-1375542119385//nodes_u= sed_collection_shard2_replica2/data/ [junit4] 2> 834830 T2173 oasc.JmxMonitoredMap. JMX monitoring is= enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBea= nServer@1ba1f28e [junit4] 2> 834831 T2173 oasc.CachingDirectoryFactory.get return new d= irectory for /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trun= k-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPI= DistributedZkTest-jetty3-1375542119385//nodes_used_collection_shard2_replic= a2/data [junit4] 2> 834831 T2173 oasc.SolrCore.getNewIndexDir New index direct= ory detected: old=3Dnull new=3D/usr/home/hudson/hudson-slave/workspace/Luce= ne-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cl= oud.CollectionsAPIDistributedZkTest-jetty3-1375542119385//nodes_used_collec= tion_shard2_replica2/data/index/ [junit4] 2> 834832 T2173 oasc.SolrCore.initIndex WARN [nodes_used_coll= ection_shard2_replica2] Solr index directory '/usr/home/hudson/hudson-slave= /workspace/Lucene-Solr-Tests-trunk-Java7/solr/build/solr-core/test/J1/./org= .apache.solr.cloud.CollectionsAPIDistributedZkTest-jetty3-1375542119385/nod= es_used_collection_shard2_replica2/data/index' doesn't exist. Creating new = index... [junit4] 2> 834832 T2173 oasc.CachingDirectoryFactory.get return new d= irectory for /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trun= k-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPI= DistributedZkTest-jetty3-1375542119385//nodes_used_collection_shard2_replic= a2/data/index [junit4] 2> 834835 T2146 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "ded= upe" [junit4] 2> 834835 T2146 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "sto= red_sig" [junit4] 2> 834836 T2173 oasc.SolrDeletionPolicy.onCommit SolrDeletion= Policy.onCommit: commits: num=3D1 [junit4] 2> =09=09commit{dir=3DMockDirWrapper(org.apache.lucene.store.= RAMDirectory@50a9d5c2 lockFactory=3Dorg.apache.lucene.store.NativeFSLockFac= tory@4635a980),segFN=3Dsegments_1,generation=3D1} [junit4] 2> 834836 T2173 oasc.SolrDeletionPolicy.updateCommits newest = commit generation =3D 1 [junit4] 2> 834836 T2146 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "dis= trib-dup-test-chain-implicit" [junit4] 2> 834837 T2146 oasc.RequestHandlers.initHandlersFromConfig c= reated standard: solr.StandardRequestHandler [junit4] 2> 834838 T2146 oasc.RequestHandlers.initHandlersFromConfig c= reated /get: solr.RealTimeGetHandler [junit4] 2> 834838 T2146 oasc.RequestHandlers.initHandlersFromConfig a= dding lazy requestHandler: solr.ReplicationHandler [junit4] 2> 834839 T2146 oasc.RequestHandlers.initHandlersFromConfig c= reated /replication: solr.ReplicationHandler [junit4] 2> 834840 T2146 oasc.RequestHandlers.initHandlersFromConfig c= reated /update: solr.UpdateRequestHandler [junit4] 2> 834840 T2146 oasc.RequestHandlers.initHandlersFromConfig c= reated /admin/: org.apache.solr.handler.admin.AdminHandlers [junit4] 2> 834840 T2173 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "ded= upe" [junit4] 2> 834841 T2173 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "sto= red_sig" [junit4] 2> 834842 T2173 oasup.UpdateRequestProcessorChain.init insert= ing DistributedUpdateProcessorFactory into updateRequestProcessorChain "dis= trib-dup-test-chain-implicit" [junit4] 2> 834843 T2173 oasc.RequestHandlers.initHandlersFromConfig c= reated standard: solr.StandardRequestHandler [junit4] 2> 834843 T2173 oasc.RequestHandlers.initHandlersFromConfig c= reated /get: solr.RealTimeGetHandler [junit4] 2> 834843 T2173 oasc.RequestHandlers.initHandlersFromConfig a= dding lazy requestHandler: solr.ReplicationHandler [junit4] 2> 834844 T2173 oasc.RequestHandlers.initHandlersFromConfig c= reated /replication: solr.ReplicationHandler [junit4] 2> 834844 T2173 oasc.RequestHandlers.initHandlersFromConfig c= reated /update: solr.UpdateRequestHandler [junit4] 2> 834845 T2173 oasc.RequestHandlers.initHandlersFromConfig c= reated /admin/: org.apache.solr.handler.admin.AdminHandlers [junit4] 2> 834860 T2173 oashl.XMLLoader.init xsltCacheLifetimeSeconds= =3D60 [junit4] 2> 834860 T2146 oashl.XMLLoader.init xsltCacheLifetimeSeconds= =3D60 [junit4] 2> 834868 T2173 oass.SolrIndexSearcher. Opening Searche= r@2775fbc0 main [junit4] 2> 834869 T2146 oass.SolrIndexSearcher. Opening Searche= r@3bb21a0c main [junit4] 2> 834870 T2173 oasu.CommitTracker. Hard AutoCommit: di= sabled [junit4] 2> 834870 T2173 oasu.CommitTracker. Soft AutoCommit: di= sabled [junit4] 2> 834871 T2146 oasu.CommitTracker. Hard AutoCommit: di= sabled [junit4] 2> 834872 T2146 oasu.CommitTracker. Soft AutoCommit: di= sabled [junit4] 2> 834874 T2205 oasc.SolrCore.registerSearcher [nodes_used_co= llection_shard2_replica2] Registered new searcher Searcher@2775fbc0 main{St= andardDirectoryReader(segments_1:1)} [junit4] 2> 834876 T2173 oasc.CoreContainer.registerCore registering c= ore: nodes_used_collection_shard2_replica2 [junit4] 2> 834876 T2206 oasc.SolrCore.registerSearcher [nodes_used_co= llection_shard1_replica1] Registered new searcher Searcher@3bb21a0c main{St= andardDirectoryReader(segments_1:1)} [junit4] 2> 834876 T2173 oasc.ZkController.register Register replica -= core:nodes_used_collection_shard2_replica2 address:http://127.0.0.1:22943 = collection:nodes_used_collection shard:shard2 [junit4] 2> 834877 T2173 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D10000&maxConnectionsPerHost=3D20&co= nnTimeout=3D15000&socketTimeout=3D30000&retry=3Dfalse [junit4] 2> 834878 T2146 oasc.CoreContainer.registerCore registering c= ore: nodes_used_collection_shard1_replica1 [junit4] 2> 834879 T2146 oasc.ZkController.register Register replica -= core:nodes_used_collection_shard1_replica1 address:http://127.0.0.1:22937 = collection:nodes_used_collection shard:shard1 [junit4] 2> 834879 T2146 oascsi.HttpClientUtil.createClient Creating n= ew http client, config:maxConnections=3D10000&maxConnectionsPerHost=3D20&co= nnTimeout=3D15000&socketTimeout=3D30000&retry=3Dfalse [junit4] 2> 835313 T2127 oasc.ShardLeaderElectionContext.waitForReplic= asToComeUp Enough replicas found to continue. [junit4] 2> 835314 T2187 oasc.ShardLeaderElectionContext.waitForReplic= asToComeUp Enough replicas found to continue. [junit4] 2> 835314 T2127 oasc.ShardLeaderElectionContext.runLeaderProc= ess I may be the new leader - try and sync [junit4] 2> 835315 T2187 oasc.ShardLeaderElectionContext.runLeaderProc= ess I may be the new leader - try and sync [junit4] 2> 835315 T2127 oasc.SyncStrategy.sync Sync replicas to http:= //127.0.0.1:22933/nodes_used_collection_shard1_replica2/ [junit4] 2> 835315 T2187 oasc.SyncStrategy.sync Sync replicas to http:= //127.0.0.1:16058/nodes_used_collection_shard2_replica1/ [junit4] 2> 835316 T2127 oasu.PeerSync.sync PeerSync: core=3Dnodes_use= d_collection_shard1_replica2 url=3Dhttp://127.0.0.1:22933 START replicas=3D= [http://127.0.0.1:22937/nodes_used_collection_shard1_replica1/] nUpdates=3D= 100 [junit4] 2> 835316 T2187 oasu.PeerSync.sync PeerSync: core=3Dnodes_use= d_collection_shard2_replica1 url=3Dhttp://127.0.0.1:16058 START replicas=3D= [http://127.0.0.1:22943/nodes_used_collection_shard2_replica2/] nUpdates=3D= 100 [junit4] 2> 835317 T2127 oasu.PeerSync.sync PeerSync: core=3Dnodes_use= d_collection_shard1_replica2 url=3Dhttp://127.0.0.1:22933 DONE. We have no= versions. sync failed. [junit4] 2> 835318 T2127 oasc.SyncStrategy.syncReplicas Leader's attem= pt to sync with shard failed, moving to the next candidate [junit4] 2> 835317 T2187 oasu.PeerSync.sync PeerSync: core=3Dnodes_use= d_collection_shard2_replica1 url=3Dhttp://127.0.0.1:16058 DONE. We have no= versions. sync failed. [junit4] 2> 835320 T2187 oasc.SyncStrategy.syncReplicas Leader's attem= pt to sync with shard failed, moving to the next candidate [junit4] 2> 835319 T2127 oasc.ShardLeaderElectionContext.runLeaderProc= ess We failed sync, but we have no versions - we can't sync in that case - = we were active before, so become leader anyway [junit4] 2> 835320 T2187 oasc.ShardLeaderElectionContext.runLeaderProc= ess We failed sync, but we have no versions - we can't sync in that case - = we were active before, so become leader anyway [junit4] 2> 835321 T2127 oasc.ShardLeaderElectionContext.runLeaderProc= ess I am the new leader: http://127.0.0.1:22933/nodes_used_collection_shard= 1_replica2/ shard1 [junit4] 2> 835321 T2187 oasc.ShardLeaderElectionContext.runLeaderProc= ess I am the new leader: http://127.0.0.1:16058/nodes_used_collection_shard= 2_replica1/ shard2 [junit4] 2> 835321 T2127 oascc.SolrZkClient.makePath makePath: /collec= tions/nodes_used_collection/leaders/shard1 [junit4] 2> 835322 T2187 oascc.SolrZkClient.makePath makePath: /collec= tions/nodes_used_collection/leaders/shard2 [junit4] 2> ASYNC NEW_CORE C2193 name=3Dnodes_used_collection_shard1_= replica1 org.apache.solr.core.SolrCore@abd6eb9 url=3Dhttp://127.0.0.1:22937= /nodes_used_collection_shard1_replica1 node=3D127.0.0.1:22937_ C2193_STATE= =3Dcoll:nodes_used_collection co [...truncated too long message...] 0 - closing IndexWriter [junit4] 2> 952428 T2115 oasu.DefaultSolrCoreState.closeIndexWriter cl= osing IndexWriter with IndexWriterCloser [junit4] 2> 952431 T2115 oasc.SolrCore.closeSearcher [new_implicit_col= l_1_a_replica1] Closing main searcher on request. [junit4] 2> 952431 T2115 oasc.CachingDirectoryFactory.close Closing Mo= ckDirectoryFactory - 2 directories currently being tracked [junit4] 2> 952432 T2115 oasc.CachingDirectoryFactory.closeCacheValue = looking to close /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-= trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Collection= sAPIDistributedZkTest-jetty4-1375542121117//new_implicit_coll_1_a_replica1/= data/index [CachedDir<>] [junit4] 2> 952432 T2115 oasc.CachingDirectoryFactory.close Closing di= rectory: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Ja= va7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDist= ributedZkTest-jetty4-1375542121117//new_implicit_coll_1_a_replica1/data/ind= ex [junit4] 2> 952433 T2115 oasc.CachingDirectoryFactory.closeCacheValue = looking to close /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-= trunk-Java7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.Collection= sAPIDistributedZkTest-jetty4-1375542121117//new_implicit_coll_1_a_replica1/= data [CachedDir<>] [junit4] 2> 952433 T2115 oasc.CachingDirectoryFactory.close Closing di= rectory: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Ja= va7/solr/build/solr-core/test/J1/./org.apache.solr.cloud.CollectionsAPIDist= ributedZkTest-jetty4-1375542121117//new_implicit_coll_1_a_replica1/data [junit4] 2> 952435 T2425 oasc.Overseer$ClusterStateUpdater.amILeader A= ccording to ZK I (id=3D90147528036450316-127.0.0.1:16058_-n_0000000004) am = no longer a leader. [junit4] 2> 952440 T2115 oejsh.ContextHandler.doStop stopped o.e.j.s.S= ervletContextHandler{/,null} [junit4] 2> 952496 T2115 oas.SolrTestCaseJ4.tearDown ###Ending testDis= tribSearch [junit4] 2> 952499 T2115 oasc.ZkTestServer.send4LetterWord connecting = to 127.0.0.1:22930 22930 [junit4] 1> client port:0.0.0.0/0.0.0.0:0 [junit4] 2> NOTE: reproduce with: ant test -Dtestcase=3DCollectionsAP= IDistributedZkTest -Dtests.method=3DtestDistribSearch -Dtests.seed=3DA0DBC4= A68435BE3C -Dtests.multiplier=3D3 -Dtests.slow=3Dtrue -Dtests.locale=3Dth -= Dtests.timezone=3DEurope/Dublin -Dtests.file.encoding=3DISO-8859-1 [junit4] ERROR 130s J1 | CollectionsAPIDistributedZkTest.testDistribS= earch <<< [junit4] > Throwable #1: org.apache.solr.client.solrj.SolrServerExcep= tion: IOException occured when talking to server at: http://127.0.0.1:22940 [junit4] > =09at __randomizedtesting.SeedInfo.seed([A0DBC4A68435BE3C:= 213D4ABEF36ADE00]:0) [junit4] > =09at org.apache.solr.client.solrj.impl.HttpSolrServer.req= uest(HttpSolrServer.java:435) [junit4] > =09at org.apache.solr.client.solrj.impl.HttpSolrServer.req= uest(HttpSolrServer.java:180) [junit4] > =09at org.apache.solr.cloud.AbstractFullDistribZkTestBase.= createCollection(AbstractFullDistribZkTestBase.java:1535) [junit4] > =09at org.apache.solr.cloud.CollectionsAPIDistributedZkTes= t.testCustomCollectionsAPI(CollectionsAPIDistributedZkTest.java:677) [junit4] > =09at org.apache.solr.cloud.CollectionsAPIDistributedZkTes= t.doTest(CollectionsAPIDistributedZkTest.java:159) [junit4] > =09at org.apache.solr.BaseDistributedSearchTestCase.testDi= stribSearch(BaseDistributedSearchTestCase.java:835) [junit4] > =09at java.lang.Thread.run(Thread.java:724) [junit4] > Caused by: org.apache.http.conn.ConnectTimeoutException: C= onnect to 127.0.0.1:22940 timed out [junit4] > =09at org.apache.http.conn.scheme.PlainSocketFactory.conne= ctSocket(PlainSocketFactory.java:129) [junit4] > =09at org.apache.http.impl.conn.DefaultClientConnectionOpe= rator.openConnection(DefaultClientConnectionOperator.java:180) [junit4] > =09at org.apache.http.impl.conn.ManagedClientConnectionImp= l.open(ManagedClientConnectionImpl.java:294) [junit4] > =09at org.apache.http.impl.client.DefaultRequestDirector.t= ryConnect(DefaultRequestDirector.java:645) [junit4] > =09at org.apache.http.impl.client.DefaultRequestDirector.e= xecute(DefaultRequestDirector.java:480) [junit4] > =09at org.apache.http.impl.client.AbstractHttpClient.execu= te(AbstractHttpClient.java:906) [junit4] > =09at org.apache.http.impl.client.AbstractHttpClient.execu= te(AbstractHttpClient.java:805) [junit4] > =09at org.apache.http.impl.client.AbstractHttpClient.execu= te(AbstractHttpClient.java:784) [junit4] > =09at org.apache.solr.client.solrj.impl.HttpSolrServer.req= uest(HttpSolrServer.java:365) [junit4] > =09... 45 more [junit4] 2> 952586 T2115 oas.SolrTestCaseJ4.deleteCore ###deleteCore [junit4] 2> 129573 T2114 ccr.ThreadLeakControl.checkThreadLeaks WARNIN= G Will linger awaiting termination of 2 leaked thread(s). [junit4] 2> 953740 T2197 oascc.ZkStateReader$3.process WARN ZooKeeper = watch triggered, but Solr cannot talk to ZK [junit4] 2> 953740 T2197 oascc.ZkStateReader$2.process A cluster state= change: WatchedEvent state:SyncConnected type:NodeChildrenChanged path:/li= ve_nodes, has occurred - updating... (live nodes size: 1) [junit4] 2> 953740 T2197 oascc.ZkStateReader$2.process WARN ZooKeeper = watch triggered, but Solr cannot talk to ZK [junit4] 2> NOTE: test params are: codec=3DLucene42: {timestamp=3DPost= ingsFormat(name=3DMockRandom), range_facet_l=3DPostingsFormat(name=3DMockRa= ndom), id=3DPostingsFormat(name=3DLucene41VarGapFixedInterval), range_facet= _sl=3DPulsing41(freqCutoff=3D20 minBlockSize=3D77 maxBlockSize=3D238), a_t= =3DPostingsFormat(name=3DMockRandom), text=3DPulsing41(freqCutoff=3D20 minB= lockSize=3D77 maxBlockSize=3D238), range_facet_si=3DPostingsFormat(name=3DM= emory doPackFST=3D false), _version_=3DPostingsFormat(name=3DMockRandom), o= ther_tl1=3DPostingsFormat(name=3DMockRandom), multiDefault=3DPostingsFormat= (name=3DMemory doPackFST=3D false), a_si=3DPostingsFormat(name=3DMemory doP= ackFST=3D false), intDefault=3DPostingsFormat(name=3DMockRandom)}, docValue= s:{timestamp=3DDocValuesFormat(name=3DDisk)}, sim=3DDefaultSimilarity, loca= le=3Dth, timezone=3DEurope/Dublin [junit4] 2> NOTE: FreeBSD 9.1-RELEASE-p3 amd64/Oracle Corporation 1.7.= 0_25 (64-bit)/cpus=3D16,threads=3D3,free=3D162674248,total=3D483393536 [junit4] 2> NOTE: All tests run in this JVM: [QueryResultKeyTest, Path= HierarchyTokenizerFactoryTest, TestJmxIntegration, SuggesterWFSTTest, TestB= inaryField, DirectUpdateHandlerTest, OpenExchangeRatesOrgProviderTest, Test= PostingsSolrHighlighter, TestManagedSchemaFieldResource, TestRandomFaceting= , BadCopyFieldTest, SampleTest, DeleteShardTest, TestRecoveryHdfs, XsltUpda= teRequestHandlerTest, TestZkChroot, TestCloudManagedSchema, TestNumberUtils= , HdfsRecoveryZkTest, TestAddFieldRealTimeGet, OpenCloseCoreStressTest, Dat= eMathParserTest, TestDFRSimilarityFactory, SimplePostToolTest, TestFieldCol= lectionResource, StatsComponentTest, TestFoldingMultitermQuery, TestLazyCor= es, TestDefaultSimilarityFactory, TermVectorComponentDistributedTest, Reque= stHandlersTest, TestUniqueKeyFieldResource, TestSolrJ, TestCoreDiscovery, T= estHashPartitioner, ShardRoutingCustomTest, SpellCheckCollatorTest, TestLuc= eneMatchVersion, CoreContainerCoreInitFailuresTest, TimeZoneUtilsTest, Test= MergePolicyConfig, TestClassNameShortening, MultiTermTest, DisMaxRequestHan= dlerTest, HdfsDirectoryTest, CurrencyFieldOpenExchangeTest, FileUtilsTest, = TestQueryTypes, SolrPluginUtilsTest, DOMUtilTest, TestReloadAndDeleteDocs, = HighlighterTest, TestFastOutputStream, IndexSchemaRuntimeFieldTest, TestBin= aryResponseWriter, FieldAnalysisRequestHandlerTest, HighlighterConfigTest, = TestJmxMonitoredMap, TestInfoStreamLogging, DefaultValueUpdateProcessorTest= , HdfsUnloadDistributedZkTest, ZkNodePropsTest, HardAutoCommitTest, SolrReq= uestParserTest, IndexBasedSpellCheckerTest, TestBM25SimilarityFactory, Test= Utils, HdfsCollectionsAPIDistributedZkTest, TestSuggestSpellingConverter, T= estManagedSchema, RequiredFieldsTest, BadIndexSchemaTest, HdfsBasicDistribu= tedZk2Test, TestPartialUpdateDeduplication, TestIndexSearcher, ChaosMonkeyS= afeLeaderTest, BasicDistributedZk2Test, CollectionsAPIDistributedZkTest] [junit4] Completed on J1 in 130.85s, 1 test, 1 error <<< FAILURES! [...truncated 596 lines...] BUILD FAILED /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/build= .xml:389: The following error occurred while executing this line: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/build= .xml:369: The following error occurred while executing this line: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/build= .xml:39: The following error occurred while executing this line: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/= build.xml:181: The following error occurred while executing this line: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/solr/= common-build.xml:449: The following error occurred while executing this lin= e: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/lucen= e/common-build.xml:1230: The following error occurred while executing this = line: /usr/home/hudson/hudson-slave/workspace/Lucene-Solr-Tests-trunk-Java7/lucen= e/common-build.xml:873: There were test failures: 320 suites, 1347 tests, 1= error, 34 ignored (6 assumptions) Total time: 57 minutes 54 seconds Build step 'Invoke Ant' marked build as failure Archiving artifacts Recording test results Email was triggered for: Failure Sending email for trigger: Failure ------=_Part_3932_1686263148.1375543457230 Content-Type: text/plain; charset=us-ascii --------------------------------------------------------------------- To unsubscribe, e-mail: dev-unsubscribe@lucene.apache.org For additional commands, e-mail: dev-help@lucene.apache.org ------=_Part_3932_1686263148.1375543457230--