See <http://hudson.zones.apache.org/hudson/job/HBase-Patch/1054/changes>
Changes:
[apurtell] HBASE-2083 [EC2] HDFS DataNode no longer required on master; require
0.20.3-dev (for now) in hbase-ec2-env.sh
[apurtell] HBASE-2083 [EC2] HDFS DataNode no longer required on master
------------------------------------------
[...truncated 118974 lines...]
[junit] Original url ftp://one.two.three/index.html, Transformed url
r:ftp://three.two.one/index.html
[junit] Original url filename, Transformed url filename
[junit] Tests run: 1, Failures: 0, Errors: 0, Time elapsed: 0.086 sec
[junit] Running org.apache.hadoop.hbase.util.TestMergeTool
[junit] 2009-12-31 18:50:55,462 WARN [main] namenode.FSNamesystem(348):
Scheme is undefined for
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/name1>
[junit] 2009-12-31 18:50:55,464 WARN [main] namenode.FSNamesystem(349):
Please check your file system configuration in hdfs-site.xml
[junit] 2009-12-31 18:50:55,465 WARN [main] namenode.FSNamesystem(348):
Scheme is undefined for
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/name2>
[junit] 2009-12-31 18:50:55,465 WARN [main] namenode.FSNamesystem(349):
Please check your file system configuration in hdfs-site.xml
[junit] 2009-12-31 18:50:55,466 WARN [main] namenode.FSNamesystem(348):
Scheme is undefined for
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/name1>
[junit] 2009-12-31 18:50:55,466 WARN [main] namenode.FSNamesystem(349):
Please check your file system configuration in hdfs-site.xml
[junit] 2009-12-31 18:50:55,466 WARN [main] namenode.FSNamesystem(348):
Scheme is undefined for
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/name2>
[junit] 2009-12-31 18:50:55,467 WARN [main] namenode.FSNamesystem(349):
Please check your file system configuration in hdfs-site.xml
[junit] 2009-12-31 18:50:55,606 WARN [main] conf.Configuration(326):
slave.host.name is deprecated. Instead, use mapreduce.tasktracker.host.name
[junit] 2009-12-31 18:50:56,159 WARN [main] namenode.FSNamesystem(348):
Scheme is undefined for
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/name1>
[junit] 2009-12-31 18:50:56,160 WARN [main] namenode.FSNamesystem(349):
Please check your file system configuration in hdfs-site.xml
[junit] 2009-12-31 18:50:56,161 WARN [main] namenode.FSNamesystem(348):
Scheme is undefined for
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/name2>
[junit] 2009-12-31 18:50:56,161 WARN [main] namenode.FSNamesystem(349):
Please check your file system configuration in hdfs-site.xml
[junit] 2009-12-31 18:50:56,162 WARN [main] namenode.FSNamesystem(348):
Scheme is undefined for
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/name1>
[junit] 2009-12-31 18:50:56,163 WARN [main] namenode.FSNamesystem(349):
Please check your file system configuration in hdfs-site.xml
[junit] 2009-12-31 18:50:56,164 WARN [main] namenode.FSNamesystem(348):
Scheme is undefined for
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/name2>
[junit] 2009-12-31 18:50:56,164 WARN [main] namenode.FSNamesystem(349):
Please check your file system configuration in hdfs-site.xml
[junit] 2009-12-31 18:50:56.211::INFO: Logging to STDERR via
org.mortbay.log.StdErrLog
[junit] 2009-12-31 18:50:56.265::INFO: jetty-6.1.14
[junit] 2009-12-31 18:50:56.331::INFO: Extract
jar:<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/lib/hadoop-hdfs-0.21.0-dev-r836012.jar!/webapps/hdfs>
to /tmp/Jetty_localhost_42416_hdfs____vh0bt1/webapp
[junit] 2009-12-31 18:50:56.728::INFO: Started
selectchannelconnec...@localhost:42416
[junit] Starting DataNode 0 with dfs.data.dir:
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/data/data1,/home/hudson/hudson-slave/workspace/HBase-Patch/trunk/build/test/data/dfs/data/data2>
[junit] 2009-12-31 18:50:57.269::INFO: jetty-6.1.14
[junit] 2009-12-31 18:50:57.274::INFO: Extract
jar:<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/lib/hadoop-hdfs-0.21.0-dev-r836012.jar!/webapps/datanode>
to /tmp/Jetty_localhost_47733_datanode____hw26aj/webapp
[junit] 2009-12-31 18:50:57.427::INFO: Started
selectchannelconnec...@localhost:47733
[junit] Starting DataNode 1 with dfs.data.dir:
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build/test/data/dfs/data/data3,/home/hudson/hudson-slave/workspace/HBase-Patch/trunk/build/test/data/dfs/data/data4>
[junit] 2009-12-31 18:50:57.906::INFO: jetty-6.1.14
[junit] 2009-12-31 18:50:57.911::INFO: Extract
jar:<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/lib/hadoop-hdfs-0.21.0-dev-r836012.jar!/webapps/datanode>
to /tmp/Jetty_localhost_47524_datanode____.sgqq85/webapp
[junit] 2009-12-31 18:50:58.042::INFO: Started
selectchannelconnec...@localhost:47524
[junit] 2009-12-31 18:50:58,110 WARN [main] conf.Configuration(326):
mapred.task.id is deprecated. Instead, use mapreduce.task.attempt.id
[junit] 2009-12-31 18:50:58,434 DEBUG [main] util.FSUtils(213): Created
version file at hdfs://localhost:46381/user/hudson set its version at:7
[junit] 2009-12-31 18:50:58,472 INFO [main] wal.HLog(274): HLog
configuration: blocksize=67108864, rollsize=63753420, enabled=true,
flushlogentries=1, optionallogflushinternal=1000ms
[junit] 2009-12-31 18:50:58,518 WARN [main] conf.Configuration(616):
fs.checkpoint.size is deprecated. Instead, use dfs.namenode.checkpoint.size
[junit] 2009-12-31 18:50:58,518 WARN [main] conf.Configuration(616):
fs.checkpoint.dir is deprecated. Instead, use dfs.namenode.checkpoint.dir
[junit] 2009-12-31 18:50:58,519 WARN [main] conf.Configuration(616):
fs.checkpoint.edits.dir is deprecated. Instead, use
dfs.namenode.checkpoint.edits.dir
[junit] 2009-12-31 18:50:58,519 WARN [main] conf.Configuration(616):
fs.checkpoint.period is deprecated. Instead, use dfs.namenode.checkpoint.period
[junit] 2009-12-31 18:50:58,549 INFO [main] wal.HLog(352): New hlog
/user/hudson/-ROOT-/70236052/.logs/hlog.dat.1262285458472
[junit] 2009-12-31 18:50:58,552 DEBUG [main] regionserver.HRegion(265):
Opening region -ROOT-,,0, encoded=70236052
[junit] 2009-12-31 18:50:58,604 INFO [main] regionserver.HRegion(343):
region -ROOT-,,0/70236052 available; sequence id is 0
[junit] 2009-12-31 18:50:58,623 INFO [main] wal.HLog(274): HLog
configuration: blocksize=67108864, rollsize=63753420, enabled=true,
flushlogentries=1, optionallogflushinternal=1000ms
[junit] 2009-12-31 18:50:58,659 WARN [main] conf.Configuration(616):
fs.checkpoint.size is deprecated. Instead, use dfs.namenode.checkpoint.size
[junit] 2009-12-31 18:50:58,659 WARN [main] conf.Configuration(616):
fs.checkpoint.dir is deprecated. Instead, use dfs.namenode.checkpoint.dir
[junit] 2009-12-31 18:50:58,660 WARN [main] conf.Configuration(616):
fs.checkpoint.edits.dir is deprecated. Instead, use
dfs.namenode.checkpoint.edits.dir
[junit] 2009-12-31 18:50:58,660 WARN [main] conf.Configuration(616):
fs.checkpoint.period is deprecated. Instead, use dfs.namenode.checkpoint.period
[junit] 2009-12-31 18:50:58,669 INFO [main] wal.HLog(352): New hlog
/user/hudson/.META./1028785192/.logs/hlog.dat.1262285458624
[junit] 2009-12-31 18:50:58,670 DEBUG [main] regionserver.HRegion(265):
Opening region .META.,,1, encoded=1028785192
[junit] 2009-12-31 18:50:58,723 INFO [main] regionserver.HRegion(343):
region .META.,,1/1028785192 available; sequence id is 0
[junit] 2009-12-31 18:50:58,745 INFO [main] wal.HLog(274): HLog
configuration: blocksize=67108864, rollsize=63753420, enabled=true,
flushlogentries=1, optionallogflushinternal=1000ms
[junit] 2009-12-31 18:50:58,779 WARN [main] conf.Configuration(616):
fs.checkpoint.size is deprecated. Instead, use dfs.namenode.checkpoint.size
[junit] 2009-12-31 18:50:58,779 WARN [main] conf.Configuration(616):
fs.checkpoint.dir is deprecated. Instead, use dfs.namenode.checkpoint.dir
[junit] 2009-12-31 18:50:58,780 WARN [main] conf.Configuration(616):
fs.checkpoint.edits.dir is deprecated. Instead, use
dfs.namenode.checkpoint.edits.dir
[junit] 2009-12-31 18:50:58,780 WARN [main] conf.Configuration(616):
fs.checkpoint.period is deprecated. Instead, use dfs.namenode.checkpoint.period
[junit] 2009-12-31 18:50:58,791 INFO [main] wal.HLog(352): New hlog
/user/hudson/TestMergeTool/519805377/.logs/hlog.dat.1262285458745
[junit] 2009-12-31 18:50:58,792 DEBUG [main] regionserver.HRegion(265):
Opening region TestMergeTool,row_0200,1262285455260, encoded=519805377
[junit] 2009-12-31 18:50:58,832 INFO [main] regionserver.HRegion(343):
region TestMergeTool,row_0200,1262285455260/519805377 available; sequence id is 0
[junit] 2009-12-31 18:50:58,854 INFO [main] wal.HLog(274): HLog
configuration: blocksize=67108864, rollsize=63753420, enabled=true,
flushlogentries=1, optionallogflushinternal=1000ms
[junit] 2009-12-31 18:50:58,878 WARN [main] conf.Configuration(616):
fs.checkpoint.size is deprecated. Instead, use dfs.namenode.checkpoint.size
[junit] 2009-12-31 18:50:58,879 WARN [main] conf.Configuration(616):
fs.checkpoint.dir is deprecated. Instead, use dfs.namenode.checkpoint.dir
[junit] 2009-12-31 18:50:58,879 WARN [main] conf.Configuration(616):
fs.checkpoint.edits.dir is deprecated. Instead, use
dfs.namenode.checkpoint.edits.dir
[junit] 2009-12-31 18:50:58,879 WARN [main] conf.Configuration(616):
fs.checkpoint.period is deprecated. Instead, use dfs.namenode.checkpoint.period
[junit] 2009-12-31 18:50:58,891 INFO [main] wal.HLog(352): New hlog
/user/hudson/TestMergeTool/264421680/.logs/hlog.dat.1262285458855
[junit] 2009-12-31 18:50:58,891 DEBUG [main] regionserver.HRegion(265):
Opening region TestMergeTool,row_0250,1262285455261, encoded=264421680
[junit] 2009-12-31 18:50:58,931 INFO [main] regionserver.HRegion(343):
region TestMergeTool,row_0250,1262285455261/264421680 available; sequence id is 0
[junit] 2009-12-31 18:50:58,951 INFO [main] wal.HLog(274): HLog
configuration: blocksize=67108864, rollsize=63753420, enabled=true,
flushlogentries=1, optionallogflushinternal=1000ms
[junit] 2009-12-31 18:50:58,976 WARN [main] conf.Configuration(616):
fs.checkpoint.size is deprecated. Instead, use dfs.namenode.checkpoint.size
[junit] 2009-12-31 18:50:58,976 WARN [main] conf.Configuration(616):
fs.checkpoint.dir is deprecated. Instead, use dfs.namenode.checkpoint.dir
[junit] 2009-12-31 18:50:58,976 WARN [main] conf.Configuration(616):
fs.checkpoint.edits.dir is deprecated. Instead, use
dfs.namenode.checkpoint.edits.dir
[junit] 2009-12-31 18:50:58,977 WARN [main] conf.Configuration(616):
fs.checkpoint.period is deprecated. Instead, use dfs.namenode.checkpoint.period
[junit] 2009-12-31 18:50:58,988 INFO [main] wal.HLog(352): New hlog
/user/hudson/TestMergeTool/1186237651/.logs/hlog.dat.1262285458952
[junit] 2009-12-31 18:50:58,988 DEBUG [main] regionserver.HRegion(265):
Opening region TestMergeTool,row_0100,1262285455261, encoded=1186237651
[junit] 2009-12-31 18:50:59,159 INFO [main] regionserver.HRegion(343):
region TestMergeTool,row_0100,1262285455261/1186237651 available; sequence id
is 0
[junit] 2009-12-31 18:50:59,195 INFO [main] wal.HLog(274): HLog
configuration: blocksize=67108864, rollsize=63753420, enabled=true,
flushlogentries=1, optionallogflushinternal=1000ms
[junit] 2009-12-31 18:50:59,218 WARN [main] conf.Configuration(616):
fs.checkpoint.size is deprecated. Instead, use dfs.namenode.checkpoint.size
[junit] 2009-12-31 18:50:59,219 WARN [main] conf.Configuration(616):
fs.checkpoint.dir is deprecated. Instead, use dfs.namenode.checkpoint.dir
[junit] 2009-12-31 18:50:59,219 WARN [main] conf.Configuration(616):
fs.checkpoint.edits.dir is deprecated. Instead, use
dfs.namenode.checkpoint.edits.dir
[junit] 2009-12-31 18:50:59,219 WARN [main] conf.Configuration(616):
fs.checkpoint.period is deprecated. Instead, use dfs.namenode.checkpoint.period
[junit] 2009-12-31 18:50:59,231 INFO [main] wal.HLog(352): New hlog
/user/hudson/TestMergeTool/329103839/.logs/hlog.dat.1262285459195
[junit] 2009-12-31 18:50:59,232 DEBUG [main] regionserver.HRegion(265):
Opening region TestMergeTool,row_0500,1262285455261, encoded=329103839
[junit] 2009-12-31 18:50:59,318 INFO [main] regionserver.HRegion(343):
region TestMergeTool,row_0500,1262285455261/329103839 available; sequence id is 0
[junit] 2009-12-31 18:50:59,355 INFO [main] wal.HLog(274): HLog
configuration: blocksize=67108864, rollsize=63753420, enabled=true,
flushlogentries=1, optionallogflushinternal=1000ms
[junit] 2009-12-31 18:50:59,383 WARN [main] conf.Configuration(616):
fs.checkpoint.size is deprecated. Instead, use dfs.namenode.checkpoint.size
[junit] 2009-12-31 18:50:59,384 WARN [main] conf.Configuration(616):
fs.checkpoint.dir is deprecated. Instead, use dfs.namenode.checkpoint.dir
[junit] 2009-12-31 18:50:59,384 WARN [main] conf.Configuration(616):
fs.checkpoint.edits.dir is deprecated. Instead, use
dfs.namenode.checkpoint.edits.dir
[junit] 2009-12-31 18:50:59,385 WARN [main] conf.Configuration(616):
fs.checkpoint.period is deprecated. Instead, use dfs.namenode.checkpoint.period
[junit] 2009-12-31 18:50:59,395 INFO [main] wal.HLog(352): New hlog
/user/hudson/TestMergeTool/601601528/.logs/hlog.dat.1262285459355
[junit] 2009-12-31 18:50:59,395 DEBUG [main] regionserver.HRegion(265):
Opening region TestMergeTool,,1262285455261, encoded=601601528
[junit] 2009-12-31 18:50:59,494 INFO [main] regionserver.HRegion(343):
region TestMergeTool,,1262285455261/601601528 available; sequence id is 0
[junit] 2009-12-31 18:50:59,496 DEBUG [main] regionserver.HRegion(454):
Closing .META.,,1: compactions & flushes disabled
[junit] 2009-12-31 18:50:59,496 DEBUG [main] regionserver.HRegion(471):
Updates disabled for region, no outstanding scanners on .META.,,1
[junit] 2009-12-31 18:50:59,496 DEBUG [main] regionserver.HRegion(478): No
more row locks outstanding on region .META.,,1
[junit] 2009-12-31 18:50:59,497 DEBUG [main] regionserver.HRegion(895):
Started memstore flush for region .META.,,1. Current region memstore size 2.2k
[junit] 2009-12-31 18:50:59,540 INFO [main] regionserver.StoreFile(241):
Allocating LruBlockCache with maximum size 98.6m
[junit] 2009-12-31 18:50:59,558 DEBUG [main] regionserver.Store(564): Added
hdfs://localhost:46381/user/hudson/.META./1028785192/info/7200970069437118205,
entries=5, sequenceid=6, memsize=2.2k, filesize=2.2k to .META.,,1
[junit] 2009-12-31 18:50:59,559 DEBUG [main] regionserver.HRegion(971):
Finished memstore flush of ~2.2k for region .META.,,1 in 63ms, sequence id=6,
compaction requested=false
[junit] 2009-12-31 18:50:59,559 DEBUG [main] regionserver.Store(482):
closed historian
[junit] 2009-12-31 18:50:59,560 DEBUG [main] regionserver.Store(482):
closed info
[junit] 2009-12-31 18:50:59,560 INFO [main] regionserver.HRegion(490):
Closed .META.,,1
[junit] 2009-12-31 18:50:59,560 DEBUG [main.logSyncer]
wal.HLog$LogSyncer(733): main.logSyncerinterrupted while waiting for sync
requests
[junit] 2009-12-31 18:50:59,560 INFO [main.logSyncer]
wal.HLog$LogSyncer(737): main.logSyncer exiting
[junit] 2009-12-31 18:50:59,561 DEBUG [main] wal.HLog(564): closing hlog
writer in hdfs://localhost:46381/user/hudson/.META./1028785192/.logs
[junit] 2009-12-31 18:50:59,594 DEBUG [main] regionserver.HRegion(454):
Closing -ROOT-,,0: compactions & flushes disabled
[junit] 2009-12-31 18:50:59,594 DEBUG [main] regionserver.HRegion(471):
Updates disabled for region, no outstanding scanners on -ROOT-,,0
[junit] 2009-12-31 18:50:59,594 DEBUG [main] regionserver.HRegion(478): No
more row locks outstanding on region -ROOT-,,0
[junit] 2009-12-31 18:50:59,594 DEBUG [main] regionserver.HRegion(895):
Started memstore flush for region -ROOT-,,0. Current region memstore size 544
[junit] 2009-12-31 18:50:59,687 DEBUG [main] regionserver.Store(564): Added
hdfs://localhost:46381/user/hudson/-ROOT-/70236052/info/5535136091345077811,
entries=1, sequenceid=2, memsize=544, filesize=809 to -ROOT-,,0
[junit] 2009-12-31 18:50:59,688 DEBUG [main] regionserver.HRegion(971):
Finished memstore flush of ~544 for region -ROOT-,,0 in 94ms, sequence id=2,
compaction requested=false
[junit] 2009-12-31 18:50:59,688 DEBUG [main] regionserver.Store(482):
closed info
[junit] 2009-12-31 18:50:59,688 INFO [main] regionserver.HRegion(490):
Closed -ROOT-,,0
[junit] 2009-12-31 18:50:59,689 DEBUG [main.logSyncer]
wal.HLog$LogSyncer(733): main.logSyncerinterrupted while waiting for sync
requests
[junit] 2009-12-31 18:50:59,689 INFO [main.logSyncer]
wal.HLog$LogSyncer(737): main.logSyncer exiting
[junit] 2009-12-31 18:50:59,689 DEBUG [main] wal.HLog(564): closing hlog
writer in hdfs://localhost:46381/user/hudson/-ROOT-/70236052/.logs
[junit] 2009-12-31 18:51:00,761 DEBUG [main] regionserver.HRegion(454):
Closing TestMergeTool,row_0200,1262285455260: compactions & flushes disabled
[junit] 2009-12-31 18:51:00,761 DEBUG [main] regionserver.HRegion(471):
Updates disabled for region, no outstanding scanners on
TestMergeTool,row_0200,1262285455260
[junit] 2009-12-31 18:51:00,761 DEBUG [main] regionserver.HRegion(478): No
more row locks outstanding on region TestMergeTool,row_0200,1262285455260
[junit] 2009-12-31 18:51:00,762 DEBUG [main] regionserver.HRegion(895):
Started memstore flush for region TestMergeTool,row_0200,1262285455260. Current
region memstore size 256
[junit] 2009-12-31 18:51:02,074 DEBUG [main] regionserver.Store(564): Added
hdfs://localhost:46381/user/hudson/TestMergeTool/519805377/contents/3270481128251840426,
entries=2, sequenceid=3, memsize=256, filesize=425 to
TestMergeTool,row_0200,1262285455260
[junit] 2009-12-31 18:51:02,075 DEBUG [main] regionserver.HRegion(971):
Finished memstore flush of ~256 for region TestMergeTool,row_0200,1262285455260
in 1313ms, sequence id=3, compaction requested=false
[junit] 2009-12-31 18:51:02,075 DEBUG [main] regionserver.Store(482):
closed contents
[junit] 2009-12-31 18:51:02,076 INFO [main] regionserver.HRegion(490):
Closed TestMergeTool,row_0200,1262285455260
[junit] 2009-12-31 18:51:02,076 DEBUG [main.logSyncer]
wal.HLog$LogSyncer(733): main.logSyncerinterrupted while waiting for sync
requests
[junit] 2009-12-31 18:51:02,076 INFO [main.logSyncer]
wal.HLog$LogSyncer(737): main.logSyncer exiting
[junit] 2009-12-31 18:51:02,076 DEBUG [main] wal.HLog(564): closing hlog
writer in hdfs://localhost:46381/user/hudson/TestMergeTool/519805377/.logs
[junit] 2009-12-31 18:51:02,109 DEBUG [main] regionserver.HRegion(454):
Closing TestMergeTool,row_0250,1262285455261: compactions & flushes disabled
[junit] 2009-12-31 18:51:02,109 DEBUG [main] regionserver.HRegion(471):
Updates disabled for region, no outstanding scanners on
TestMergeTool,row_0250,1262285455261
[junit] 2009-12-31 18:51:02,109 DEBUG [main] regionserver.HRegion(478): No
more row locks outstanding on region TestMergeTool,row_0250,1262285455261
[junit] 2009-12-31 18:51:02,109 DEBUG [main] regionserver.HRegion(895):
Started memstore flush for region TestMergeTool,row_0250,1262285455261. Current
region memstore size 376
[junit] 2009-12-31 18:51:03,221 DEBUG [main] regionserver.Store(564): Added
hdfs://localhost:46381/user/hudson/TestMergeTool/264421680/contents/6364339050493181113,
entries=3, sequenceid=4, memsize=376, filesize=469 to
TestMergeTool,row_0250,1262285455261
[junit] 2009-12-31 18:51:03,221 DEBUG [main] regionserver.HRegion(971):
Finished memstore flush of ~376 for region TestMergeTool,row_0250,1262285455261
in 1112ms, sequence id=4, compaction requested=false
[junit] 2009-12-31 18:51:03,222 DEBUG [main] regionserver.Store(482):
closed contents
[junit] 2009-12-31 18:51:03,222 INFO [main] regionserver.HRegion(490):
Closed TestMergeTool,row_0250,1262285455261
[junit] 2009-12-31 18:51:03,222 DEBUG [main.logSyncer]
wal.HLog$LogSyncer(733): main.logSyncerinterrupted while waiting for sync
requests
[junit] 2009-12-31 18:51:03,222 INFO [main.logSyncer]
wal.HLog$LogSyncer(737): main.logSyncer exiting
[junit] 2009-12-31 18:51:03,223 DEBUG [main] wal.HLog(564): closing hlog
writer in hdfs://localhost:46381/user/hudson/TestMergeTool/264421680/.logs
[junit] 2009-12-31 18:51:03,253 DEBUG [main] regionserver.HRegion(454):
Closing TestMergeTool,row_0100,1262285455261: compactions & flushes disabled
[junit] 2009-12-31 18:51:03,253 DEBUG [main] regionserver.HRegion(471):
Updates disabled for region, no outstanding scanners on
TestMergeTool,row_0100,1262285455261
[junit] 2009-12-31 18:51:03,253 DEBUG [main] regionserver.HRegion(478): No
more row locks outstanding on region TestMergeTool,row_0100,1262285455261
[junit] 2009-12-31 18:51:03,254 DEBUG [main] regionserver.HRegion(895):
Started memstore flush for region TestMergeTool,row_0100,1262285455261. Current
region memstore size 256
[junit] 2009-12-31 18:51:03,298 DEBUG [main] regionserver.Store(564): Added
hdfs://localhost:46381/user/hudson/TestMergeTool/1186237651/contents/8607717290983340531,
entries=2, sequenceid=5, memsize=256, filesize=425 to
TestMergeTool,row_0100,1262285455261
[junit] 2009-12-31 18:51:03,298 DEBUG [main] regionserver.HRegion(971):
Finished memstore flush of ~256 for region TestMergeTool,row_0100,1262285455261
in 44ms, sequence id=5, compaction requested=false
[junit] 2009-12-31 18:51:03,299 DEBUG [main] regionserver.Store(482):
closed contents
[junit] 2009-12-31 18:51:03,299 INFO [main] regionserver.HRegion(490):
Closed TestMergeTool,row_0100,1262285455261
[junit] 2009-12-31 18:51:03,299 DEBUG [main.logSyncer]
wal.HLog$LogSyncer(733): main.logSyncerinterrupted while waiting for sync
requests
[junit] 2009-12-31 18:51:03,299 INFO [main.logSyncer]
wal.HLog$LogSyncer(737): main.logSyncer exiting
[junit] 2009-12-31 18:51:03,300 DEBUG [main] wal.HLog(564): closing hlog
writer in hdfs://localhost:46381/user/hudson/TestMergeTool/1186237651/.logs
[junit] 2009-12-31 18:51:03,334 DEBUG [main] regionserver.HRegion(454):
Closing TestMergeTool,row_0500,1262285455261: compactions & flushes disabled
[junit] 2009-12-31 18:51:03,335 DEBUG [main] regionserver.HRegion(471):
Updates disabled for region, no outstanding scanners on
TestMergeTool,row_0500,1262285455261
[junit] 2009-12-31 18:51:03,335 DEBUG [main] regionserver.HRegion(478): No
more row locks outstanding on region TestMergeTool,row_0500,1262285455261
[junit] 2009-12-31 18:51:03,335 DEBUG [main] regionserver.HRegion(895):
Started memstore flush for region TestMergeTool,row_0500,1262285455261. Current
region memstore size 256
[junit] 2009-12-31 18:51:03,381 DEBUG [main] regionserver.Store(564): Added
hdfs://localhost:46381/user/hudson/TestMergeTool/329103839/contents/7424119396839854546,
entries=2, sequenceid=6, memsize=256, filesize=425 to
TestMergeTool,row_0500,1262285455261
[junit] 2009-12-31 18:51:03,382 DEBUG [main] regionserver.HRegion(971):
Finished memstore flush of ~256 for region TestMergeTool,row_0500,1262285455261
in 47ms, sequence id=6, compaction requested=false
[junit] 2009-12-31 18:51:03,382 DEBUG [main] regionserver.Store(482):
closed contents
[junit] 2009-12-31 18:51:03,382 INFO [main] regionserver.HRegion(490):
Closed TestMergeTool,row_0500,1262285455261
[junit] 2009-12-31 18:51:03,383 DEBUG [main.logSyncer]
wal.HLog$LogSyncer(733): main.logSyncerinterrupted while waiting for sync
requests
[junit] 2009-12-31 18:51:03,383 INFO [main.logSyncer]
wal.HLog$LogSyncer(737): main.logSyncer exiting
[junit] 2009-12-31 18:51:03,383 DEBUG [main] wal.HLog(564): closing hlog
writer in hdfs://localhost:46381/user/hudson/TestMergeTool/329103839/.logs
[junit] 2009-12-31 18:51:03,418 DEBUG [main] regionserver.HRegion(454):
Closing TestMergeTool,,1262285455261: compactions & flushes disabled
[junit] 2009-12-31 18:51:03,418 DEBUG [main] regionserver.HRegion(471):
Updates disabled for region, no outstanding scanners on
TestMergeTool,,1262285455261
[junit] 2009-12-31 18:51:03,419 DEBUG [main] regionserver.HRegion(478): No
more row locks outstanding on region TestMergeTool,,1262285455261
[junit] 2009-12-31 18:51:03,419 DEBUG [main] regionserver.HRegion(895):
Started memstore flush for region TestMergeTool,,1262285455261. Current region
memstore size 256
[junit] 2009-12-31 18:51:03,505 DEBUG [main] regionserver.Store(564): Added
hdfs://localhost:46381/user/hudson/TestMergeTool/601601528/contents/4273622605781880821,
entries=2, sequenceid=7, memsize=256, filesize=425 to
TestMergeTool,,1262285455261
[junit] 2009-12-31 18:51:03,505 DEBUG [main] regionserver.HRegion(971):
Finished memstore flush of ~256 for region TestMergeTool,,1262285455261 in
86ms, sequence id=7, compaction requested=false
[junit] 2009-12-31 18:51:03,506 DEBUG [main] regionserver.Store(482):
closed contents
[junit] 2009-12-31 18:51:03,506 INFO [main] regionserver.HRegion(490):
Closed TestMergeTool,,1262285455261
[junit] 2009-12-31 18:51:03,506 DEBUG [main.logSyncer]
wal.HLog$LogSyncer(733): main.logSyncerinterrupted while waiting for sync
requests
[junit] 2009-12-31 18:51:03,507 INFO [main.logSyncer]
wal.HLog$LogSyncer(737): main.logSyncer exiting
[junit] 2009-12-31 18:51:03,507 DEBUG [main] wal.HLog(564): closing hlog
writer in hdfs://localhost:46381/user/hudson/TestMergeTool/601601528/.logs
[junit] 2009-12-31 18:51:04,572 INFO [main] util.TestMergeTool(248):
Creating log /tmp/.logs_1262285464572
[junit] 2009-12-31 18:51:04,588 INFO [main] wal.HLog(274): HLog
configuration: blocksize=67108864, rollsize=63753420, enabled=true,
flushlogentries=1, optionallogflushinternal=1000ms
[junit] 2009-12-31 18:51:04,608 WARN [main] conf.Configuration(616):
fs.checkpoint.size is deprecated. Instead, use dfs.namenode.checkpoint.size
[junit] 2009-12-31 18:51:04,608 WARN [main] conf.Configuration(616):
fs.checkpoint.dir is deprecated. Instead, use dfs.namenode.checkpoint.dir
[junit] 2009-12-31 18:51:04,608 WARN [main] conf.Configuration(616):
fs.checkpoint.edits.dir is deprecated. Instead, use
dfs.namenode.checkpoint.edits.dir
[junit] 2009-12-31 18:51:04,609 WARN [main] conf.Configuration(616):
fs.checkpoint.period is deprecated. Instead, use dfs.namenode.checkpoint.period
[junit] 2009-12-31 18:51:04,620 INFO [main] wal.HLog(352): New hlog
/tmp/.logs_1262285464572/hlog.dat.1262285464588
[junit] 2009-12-31 18:51:04,623 INFO [main] util.TestMergeTool(173):
merging regions 0 and 1
[junit] 2009-12-31 18:51:04,630 WARN [main] conf.Configuration(616):
mapred.used.genericoptionsparser is deprecated. Instead, use
mapreduce.client.genericoptionsparser.used
[junit] 2009-12-31 18:51:04,630 WARN [main] conf.Configuration(616):
mapred.used.genericoptionsparser is deprecated. Instead, use
mapreduce.client.genericoptionsparser.used
[junit] 2009-12-31 18:51:04,631 INFO [main] util.Merge(82): Verifying that
file system is available...
[junit] 2009-12-31 18:51:04,648 INFO [main] util.Merge(91): Verifying that
HBase is not running...
[junit] 2009-12-31 18:51:04,670 WARN [main] conf.Configuration(616):
fs.checkpoint.size is deprecated. Instead, use dfs.namenode.checkpoint.size
[junit] 2009-12-31 18:51:04,670 WARN [main] conf.Configuration(616):
fs.checkpoint.dir is deprecated. Instead, use dfs.namenode.checkpoint.dir
[junit] 2009-12-31 18:51:04,671 WARN [main] conf.Configuration(616):
fs.checkpoint.edits.dir is deprecated. Instead, use
dfs.namenode.checkpoint.edits.dir
[junit] 2009-12-31 18:51:04,671 WARN [main] conf.Configuration(616):
fs.checkpoint.period is deprecated. Instead, use dfs.namenode.checkpoint.period
[junit] 2009-12-31 18:51:04,922 DEBUG [main]
zookeeper.ZooKeeperWrapper(392): Read ZNode /hbase/master got 67.195.138.9:60000
[junit] 2009-12-31 18:51:04,946 FATAL [main] util.Merge(94): HBase cluster
must be off-line.
[junit] 2009-12-31 18:51:04,946 DEBUG [main.logSyncer]
wal.HLog$LogSyncer(733): main.logSyncerinterrupted while waiting for sync
requests
[junit] 2009-12-31 18:51:04,946 INFO [main.logSyncer]
wal.HLog$LogSyncer(737): main.logSyncer exiting
[junit] 2009-12-31 18:51:04,946 DEBUG [main] wal.HLog(564): closing hlog
writer in /tmp/.logs_1262285464572
[junit] 2009-12-31 18:51:06,035 INFO [main] hbase.HBaseTestCase(627):
Shutting down Mini DFS
[junit] Shutting down the Mini HDFS Cluster
[junit] Shutting down DataNode 1
[junit] 2009-12-31 18:51:06,138 WARN
[org.apache.hadoop.hdfs.server.datanode.dataxceiverser...@1681ea]
datanode.DataXceiverServer(140): DatanodeRegistration(127.0.0.1:37419,
storageID=DS-2056769545-67.195.138.9-37419-1262285458046, infoPort=47524,
ipcPort=50863):DataXceiveServer: java.nio.channels.AsynchronousCloseException
[junit] at
java.nio.channels.spi.AbstractInterruptibleChannel.end(AbstractInterruptibleChannel.java:185)
[junit] at
sun.nio.ch.ServerSocketChannelImpl.accept(ServerSocketChannelImpl.java:152)
[junit] at
sun.nio.ch.ServerSocketAdaptor.accept(ServerSocketAdaptor.java:84)
[junit] at
org.apache.hadoop.hdfs.server.datanode.DataXceiverServer.run(DataXceiverServer.java:133)
[junit] at java.lang.Thread.run(Thread.java:619)
[junit]
[junit] Shutting down DataNode 0
[junit] 2009-12-31 18:51:06,242 WARN
[org.apache.hadoop.hdfs.server.datanode.dataxceiverser...@940f82]
datanode.DataXceiverServer(140): DatanodeRegistration(127.0.0.1:40574,
storageID=DS-870427145-67.195.138.9-40574-1262285457433, infoPort=47733,
ipcPort=51766):DataXceiveServer: java.nio.channels.AsynchronousCloseException
[junit] at
java.nio.channels.spi.AbstractInterruptibleChannel.end(AbstractInterruptibleChannel.java:185)
[junit] at
sun.nio.ch.ServerSocketChannelImpl.accept(ServerSocketChannelImpl.java:152)
[junit] at
sun.nio.ch.ServerSocketAdaptor.accept(ServerSocketAdaptor.java:84)
[junit] at
org.apache.hadoop.hdfs.server.datanode.DataXceiverServer.run(DataXceiverServer.java:133)
[junit] at java.lang.Thread.run(Thread.java:619)
[junit]
[junit] 2009-12-31 18:51:06,345 WARN
[org.apache.hadoop.hdfs.server.namenode.fsnamesystem$replicationmoni...@1a6684f]
namenode.FSNamesystem$ReplicationMonitor(2326): ReplicationMonitor thread
received InterruptedException.java.lang.InterruptedException: sleep interrupted
[junit] 2009-12-31 18:51:06,345 WARN
[org.apache.hadoop.hdfs.server.namenode.decommissionmanager$moni...@17ec9f7]
namenode.DecommissionManager$Monitor(67): Monitor interrupted:
java.lang.InterruptedException: sleep interrupted
[junit] 2009-12-31 18:51:06,359 INFO [main] hbase.HBaseTestCase(638):
Shutting down FileSystem
[junit] Tests run: 1, Failures: 1, Errors: 0, Time elapsed: 11.277 sec
[junit] 2009-12-31 18:51:06,756 DEBUG [HCM.shutdownHook]
zookeeper.ZooKeeperWrapper(632): Closed connection with ZooKeeper
[junit] Test org.apache.hadoop.hbase.util.TestMergeTool FAILED
[junit] Running org.apache.hadoop.hbase.util.TestRootPath
[junit] 2009-12-31 18:51:07,093 INFO [main] util.TestRootPath(60): Got
expected exception when checking invalid path:
[junit] java.io.IOException: Root directory does not have a scheme
[junit] at
org.apache.hadoop.hbase.util.FSUtils.validateRootPath(FSUtils.java:228)
[junit] at
org.apache.hadoop.hbase.util.TestRootPath.testRootPath(TestRootPath.java:56)
[junit] at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit] at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:39)
[junit] at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:25)
[junit] at java.lang.reflect.Method.invoke(Method.java:597)
[junit] at junit.framework.TestCase.runTest(TestCase.java:168)
[junit] at junit.framework.TestCase.runBare(TestCase.java:134)
[junit] at junit.framework.TestResult$1.protect(TestResult.java:110)
[junit] at junit.framework.TestResult.runProtected(TestResult.java:128)
[junit] at junit.framework.TestResult.run(TestResult.java:113)
[junit] at junit.framework.TestCase.run(TestCase.java:124)
[junit] at junit.framework.TestSuite.runTest(TestSuite.java:232)
[junit] at junit.framework.TestSuite.run(TestSuite.java:227)
[junit] at
org.junit.internal.runners.JUnit38ClassRunner.run(JUnit38ClassRunner.java:83)
[junit] at
junit.framework.JUnit4TestAdapter.run(JUnit4TestAdapter.java:39)
[junit] at
org.apache.tools.ant.taskdefs.optional.junit.JUnitTestRunner.run(JUnitTestRunner.java:421)
[junit] at
org.apache.tools.ant.taskdefs.optional.junit.JUnitTestRunner.launch(JUnitTestRunner.java:912)
[junit] at
org.apache.tools.ant.taskdefs.optional.junit.JUnitTestRunner.main(JUnitTestRunner.java:766)
[junit] Tests run: 1, Failures: 0, Errors: 0, Time elapsed: 0.078 sec
BUILD FAILED
<http://hudson.zones.apache.org/hudson/job/HBase-Patch/ws/trunk/build.xml>:504:
Tests failed!
Total time: 28 minutes 55 seconds
[locks-and-latches] Releasing all the locks
[locks-and-latches] All the locks released
Archiving artifacts
Recording test results
Publishing Clover coverage report...
No Clover report will be published due to a Build Failure
