You are viewing a plain text version of this content. The canonical link for it is here.
Posted to dev@mesos.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2013/04/20 10:26:44 UTC
Build failed in Jenkins:
Mesos-Trunk-Ubuntu-Build-Out-Of-Src-Disable-Java-Disable-Python-Disable-Webui
#313
See <https://builds.apache.org/job/Mesos-Trunk-Ubuntu-Build-Out-Of-Src-Disable-Java-Disable-Python-Disable-Webui/313/changes>
Changes:
[bmahler] Fixed a regression in the hadoop-0.20.205.0_hadoop-env.sh.patch file.
Review: https://reviews.apache.org/r/10668
[bmahler] Removed the loop in Process.settle test, in favor of external looping.
From: Ben Mahler <be...@gmail.com>
Review: https://reviews.apache.org/r/10666
[bmahler] Fixed the Hadoop patches to set the classpath correctly.
From: Brenden Matthews <br...@diddyinc.com>
Review: https://reviews.apache.org/r/10489
[bmahler] Added a check for required build tools in the Hadoop tutorial.
From: Brenden Matthews <br...@diddyinc.com>
Review: https://reviews.apache.org/r/10558
[bmahler] Fixed multimap to compile with GCC 4.7.
From: Brenden Matthews <br...@diddyinc.com>
Review: https://reviews.apache.org/r/10561
[vinodkone] Fixed status udpate manager to ignore unexpected acknowledgements.
Review: https://reviews.apache.org/r/10660
------------------------------------------
[...truncated 8228 lines...]
I0420 08:26:43.599048 10095 master.cpp:309] Master started on 67.195.138.60:39863
I0420 08:26:43.599695 10095 master.cpp:324] Master ID: 201304200826-1015726915-39863-10070
I0420 08:26:43.600244 10096 hierarchical_allocator_process.hpp:236] Initializing hierarchical allocator process with master : master@67.195.138.60:39863
I0420 08:26:43.599822 10090 sched.cpp:182] New master at master@67.195.138.60:39863
W0420 08:26:43.600263 10094 master.cpp:81] No whitelist given. Advertising offers for all slaves
I0420 08:26:43.600380 10095 master.cpp:603] Elected as master!
I0420 08:26:43.599442 10089 slave.cpp:210] Slave started on 40)@67.195.138.60:39863
I0420 08:26:43.644130 10095 master.cpp:646] Registering framework 201304200826-1015726915-39863-10070-0000 at scheduler(31)@67.195.138.60:39863
I0420 08:26:43.644778 10089 slave.cpp:211] Slave resources: cpus=2; mem=1024; ports=[31000-32000]; disk=1024
I0420 08:26:43.646385 10089 slave.cpp:530] New master detected at master@67.195.138.60:39863
I0420 08:26:43.646499 10089 slave.cpp:545] Postponing registration until recovery is complete
I0420 08:26:43.646985 10089 slave.cpp:391] Finished recovery
I0420 08:26:43.645584 10095 hierarchical_allocator_process.hpp:268] Added framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.647935 10095 hierarchical_allocator_process.hpp:668] No resources available to allocate!
I0420 08:26:43.649409 10095 hierarchical_allocator_process.hpp:599] Performed allocation for 0 slaves in 1.473828000000000ms
I0420 08:26:43.647546 10096 master.cpp:968] Attempting to register slave on janus.apache.org at slave(40)@67.195.138.60:39863
I0420 08:26:43.650384 10096 master.cpp:1224] Master now considering a slave at janus.apache.org:39863 as active
I0420 08:26:43.645582 10091 sched.cpp:217] Framework registered with 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.646513 10092 status_update_manager.cpp:154] New master detected at master@67.195.138.60:39863
I0420 08:26:43.650928 10096 master.cpp:1885] Adding slave 201304200826-1015726915-39863-10070-0 at janus.apache.org with cpus=2; mem=1024; ports=[31000-32000]; disk=1024
I0420 08:26:43.652516 10094 slave.cpp:590] Registered with master master@67.195.138.60:39863; given slave ID 201304200826-1015726915-39863-10070-0
I0420 08:26:43.652587 10095 hierarchical_allocator_process.hpp:395] Added slave 201304200826-1015726915-39863-10070-0 (janus.apache.org) with cpus=2; mem=1024; ports=[31000-32000]; disk=1024 (and cpus=2; mem=1024; ports=[31000-32000]; disk=1024 available)
I0420 08:26:43.654312 10095 hierarchical_allocator_process.hpp:660] Found available resources: cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.654817 10095 hierarchical_allocator_process.hpp:686] Offering cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0 to framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.655413 10095 hierarchical_allocator_process.hpp:619] Performed allocation for slave 201304200826-1015726915-39863-10070-0 in 1.110470000000000ms
I0420 08:26:43.655448 10094 master.hpp:309] Adding offer with resources cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.656344 10094 master.cpp:1327] Sending 1 offers to framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.656869 10093 sched.cpp:282] Received 1 offers
I0420 08:26:43.657474 10094 master.cpp:1556] Processing reply for offer 201304200826-1015726915-39863-10070-0 on slave 201304200826-1015726915-39863-10070-0 (janus.apache.org) for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.657933 10094 master.hpp:289] Adding task with resources cpus=2; mem=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.658412 10094 master.cpp:1674] Launching task 0 of framework 201304200826-1015726915-39863-10070-0000 with resources cpus=2; mem=1024 on slave 201304200826-1015726915-39863-10070-0 (janus.apache.org)
I0420 08:26:43.659026 10093 slave.cpp:719] Got assigned task 0 for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.659080 10090 hierarchical_allocator_process.hpp:471] Framework 201304200826-1015726915-39863-10070-0000 left ports=[31000-32000]; disk=1024 unused on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.660111 10090 hierarchical_allocator_process.hpp:497] Framework 201304200826-1015726915-39863-10070-0000 filtered slave 201304200826-1015726915-39863-10070-0 for 5.000000000000000secs
I0420 08:26:43.659608 10093 slave.cpp:817] Launching task 0 for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.659090 10094 master.hpp:318] Removing offer with resources cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.662889 10093 paths.hpp:302] Created executor directory '/tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/3bfb6b24-f462-4992-8641-bb72eb0d280c'
I0420 08:26:43.663537 10093 slave.cpp:928] Queuing task '0' for executor default of framework '201304200826-1015726915-39863-10070-0000
I0420 08:26:43.663620 10090 exec.cpp:170] Executor started at: executor(16)@67.195.138.60:39863 with pid 10070
I0420 08:26:43.664433 10093 slave.cpp:512] Successfully attached file '/tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/3bfb6b24-f462-4992-8641-bb72eb0d280c'
I0420 08:26:43.665963 10093 slave.cpp:1385] Got registration for executor 'default' of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.666785 10093 slave.cpp:1500] Flushing queued task 0 for executor 'default' of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.666805 10095 exec.cpp:194] Executor registered on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.669456 10095 exec.cpp:258] Executor asked to run task '0'
I0420 08:26:43.670116 10095 exec.cpp:382] Executor sending status update for task 0 in state TASK_RUNNING
I0420 08:26:43.672227 10095 slave.cpp:1729] Handling status update TASK_RUNNING (UUID: a69a227c-3ed6-4af0-93fa-01c45416edb4) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.672333 10095 status_update_manager.cpp:289] Received status update TASK_RUNNING (UUID: a69a227c-3ed6-4af0-93fa-01c45416edb4) for task 0 of framework 201304200826-1015726915-39863-10070-0000 with checkpoint=false
I0420 08:26:43.672628 10095 status_update_manager.cpp:450] Creating StatusUpdate stream for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.673387 10095 status_update_manager.cpp:335] Forwarding status update TASK_RUNNING (UUID: a69a227c-3ed6-4af0-93fa-01c45416edb4) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to the master at master@67.195.138.60:39863
I0420 08:26:43.700103 10090 master.cpp:1086] Status update from (138)@67.195.138.60:39863: task 0 of framework 201304200826-1015726915-39863-10070-0000 is now in state TASK_RUNNING
I0420 08:26:43.700105 10095 slave.cpp:1786] Status update manager successfully handled status update TASK_RUNNING (UUID: a69a227c-3ed6-4af0-93fa-01c45416edb4) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.714310 10095 slave.cpp:1792] Sending acknowledgement for status update TASK_RUNNING (UUID: a69a227c-3ed6-4af0-93fa-01c45416edb4) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to executor executor(16)@67.195.138.60:39863
I0420 08:26:43.713718 10090 sched.cpp:327] Received status update TASK_RUNNING (UUID: a69a227c-3ed6-4af0-93fa-01c45416edb4) for task 0 of framework 201304200826-1015726915-39863-10070-0000 from slave(40)@67.195.138.60:39863
I0420 08:26:43.715158 10095 exec.cpp:289] Executor received ACK for status update of task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.716022 10090 sched.cpp:360] Sending ACK for status update TASK_RUNNING (UUID: a69a227c-3ed6-4af0-93fa-01c45416edb4) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to slave(40)@67.195.138.60:39863
I0420 08:26:43.716249 10091 process.cpp:2922] Handling HTTP event for process 'files' with path: '/files/browse.json'
I0420 08:26:43.717612 10090 slave.cpp:1292] Got status update acknowledgement a69a227c-3ed6-4af0-93fa-01c45416edb4 for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.719023 10097 process.cpp:870] Socket closed while receiving
I0420 08:26:43.719923 10090 status_update_manager.cpp:360] Received status update acknowledgement a69a227c-3ed6-4af0-93fa-01c45416edb4 for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.720958 10096 slave.cpp:2034] Executor 'default' of framework 201304200826-1015726915-39863-10070-0000 has exited with status '0'
I0420 08:26:43.722712 10096 slave.cpp:1729] Handling status update TASK_LOST (UUID: afe729f9-f59c-41db-8cb6-4a416c192a32) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.722862 10090 status_update_manager.cpp:289] Received status update TASK_LOST (UUID: afe729f9-f59c-41db-8cb6-4a416c192a32) for task 0 of framework 201304200826-1015726915-39863-10070-0000 with checkpoint=false
I0420 08:26:43.723602 10090 status_update_manager.cpp:335] Forwarding status update TASK_LOST (UUID: afe729f9-f59c-41db-8cb6-4a416c192a32) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to the master at master@67.195.138.60:39863
I0420 08:26:43.722914 10089 master.cpp:1188] Executor default of framework 201304200826-1015726915-39863-10070-0000 on slave 201304200826-1015726915-39863-10070-0 (janus.apache.org) exited with status 0
I0420 08:26:43.722880 10096 slave.cpp:1335] Status update manager successfully handled status update acknowledgement a69a227c-3ed6-4af0-93fa-01c45416edb4 for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.726443 10096 slave.cpp:1786] Status update manager successfully handled status update TASK_LOST (UUID: afe729f9-f59c-41db-8cb6-4a416c192a32) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.725914 10089 master.cpp:1086] Status update from (138)@67.195.138.60:39863: task 0 of framework 201304200826-1015726915-39863-10070-0000 is now in state TASK_LOST
I0420 08:26:43.727228 10096 slave.cpp:1792] Sending acknowledgement for status update TASK_LOST (UUID: afe729f9-f59c-41db-8cb6-4a416c192a32) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to executor executor(16)@67.195.138.60:39863
I0420 08:26:43.728051 10089 master.hpp:300] Removing task with resources cpus=2; mem=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.728066 10090 sched.cpp:327] Received status update TASK_LOST (UUID: afe729f9-f59c-41db-8cb6-4a416c192a32) for task 0 of framework 201304200826-1015726915-39863-10070-0000 from slave(40)@67.195.138.60:39863
I0420 08:26:43.729789 10090 sched.cpp:360] Sending ACK for status update TASK_LOST (UUID: afe729f9-f59c-41db-8cb6-4a416c192a32) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to slave(40)@67.195.138.60:39863
I0420 08:26:43.730279 10090 slave.cpp:1292] Got status update acknowledgement afe729f9-f59c-41db-8cb6-4a416c192a32 for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.729367 10089 hierarchical_allocator_process.hpp:544] Recovered cpus=2; mem=1024 (total allocatable: cpus=2; mem=1024; ports=[31000-32000]; disk=1024) on slave 201304200826-1015726915-39863-10070-0 from framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.730880 10090 status_update_manager.cpp:360] Received status update acknowledgement afe729f9-f59c-41db-8cb6-4a416c192a32 for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.732424 10090 status_update_manager.cpp:481] Cleaning up status update stream for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.733031 10090 slave.cpp:1335] Status update manager successfully handled status update acknowledgement afe729f9-f59c-41db-8cb6-4a416c192a32 for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.733435 10090 slave.cpp:2169] Cleaning up executor 'default' of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.734740 10090 slave.cpp:2233] Cleaning up framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.735201 10094 status_update_manager.cpp:251] Closing status update streams for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.734812 10095 gc.cpp:56] Scheduling '/tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/3bfb6b24-f462-4992-8641-bb72eb0d280c' for removal
I0420 08:26:43.736948 10095 gc.cpp:56] Scheduling '/tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default' for removal
I0420 08:26:43.737478 10095 gc.cpp:56] Scheduling '/tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000' for removal
I0420 08:26:43.745070 10095 slave.cpp:2483] Current disk usage 100.00%. Max allowed age: 0.000000000000000ns
I0420 08:26:43.745167 10095 gc.cpp:167] Pruning directories with remaining removal time 1.000000000000000weeks
I0420 08:26:43.748450 10095 gc.cpp:134] Deleting /tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/3bfb6b24-f462-4992-8641-bb72eb0d280c
I0420 08:26:43.767813 10095 gc.cpp:143] Deleted '/tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/3bfb6b24-f462-4992-8641-bb72eb0d280c'
I0420 08:26:43.768501 10095 gc.cpp:134] Deleting /tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default
I0420 08:26:43.769348 10095 gc.cpp:143] Deleted '/tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default'
I0420 08:26:43.769965 10095 gc.cpp:134] Deleting /tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000
I0420 08:26:43.770787 10095 gc.cpp:143] Deleted '/tmp/GarbageCollectorIntegrationTest_DiskUsage_ozXbwG/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000'
I0420 08:26:43.775585 10092 process.cpp:2922] Handling HTTP event for process 'files' with path: '/files/browse.json'
I0420 08:26:43.775955 10097 process.cpp:870] Socket closed while receiving
I0420 08:26:43.776572 10070 master.cpp:477] Master terminating
I0420 08:26:43.777468 10070 master.cpp:283] Shutting down master
I0420 08:26:43.777482 10090 slave.cpp:486] Slave asked to shut down by master@67.195.138.60:39863
I0420 08:26:43.778508 10090 slave.cpp:441] Slave terminating
I0420 08:26:43.777978 10094 hierarchical_allocator_process.hpp:359] Deactivated framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.776587 10093 sched.cpp:422] Stopping framework '201304200826-1015726915-39863-10070-0000'
[ OK ] GarbageCollectorIntegrationTest.DiskUsage (182 ms)
[ RUN ] GarbageCollectorIntegrationTest.Unschedule
I0420 08:26:43.781172 10090 master.cpp:309] Master started on 67.195.138.60:39863
I0420 08:26:43.781214 10090 master.cpp:324] Master ID: 201304200826-1015726915-39863-10070
I0420 08:26:43.781713 10089 slave.cpp:210] Slave started on 41)@67.195.138.60:39863
I0420 08:26:43.782380 10096 hierarchical_allocator_process.hpp:236] Initializing hierarchical allocator process with master : master@67.195.138.60:39863
W0420 08:26:43.782395 10094 master.cpp:81] No whitelist given. Advertising offers for all slaves
I0420 08:26:43.782554 10090 master.cpp:603] Elected as master!
I0420 08:26:43.783682 10089 slave.cpp:211] Slave resources: cpus=2; mem=1024; ports=[31000-32000]; disk=1024
I0420 08:26:43.789433 10089 slave.cpp:530] New master detected at master@67.195.138.60:39863
I0420 08:26:43.789525 10089 slave.cpp:545] Postponing registration until recovery is complete
I0420 08:26:43.790002 10089 slave.cpp:391] Finished recovery
I0420 08:26:43.789556 10095 status_update_manager.cpp:154] New master detected at master@67.195.138.60:39863
I0420 08:26:43.790565 10092 master.cpp:968] Attempting to register slave on janus.apache.org at slave(41)@67.195.138.60:39863
I0420 08:26:43.791472 10092 master.cpp:1224] Master now considering a slave at janus.apache.org:39863 as active
I0420 08:26:43.791973 10092 master.cpp:1885] Adding slave 201304200826-1015726915-39863-10070-0 at janus.apache.org with cpus=2; mem=1024; ports=[31000-32000]; disk=1024
I0420 08:26:43.792496 10089 slave.cpp:590] Registered with master master@67.195.138.60:39863; given slave ID 201304200826-1015726915-39863-10070-0
I0420 08:26:43.792570 10091 hierarchical_allocator_process.hpp:395] Added slave 201304200826-1015726915-39863-10070-0 (janus.apache.org) with cpus=2; mem=1024; ports=[31000-32000]; disk=1024 (and cpus=2; mem=1024; ports=[31000-32000]; disk=1024 available)
I0420 08:26:43.793433 10091 hierarchical_allocator_process.hpp:632] No users to allocate resources!
I0420 08:26:43.793932 10091 hierarchical_allocator_process.hpp:619] Performed allocation for slave 201304200826-1015726915-39863-10070-0 in 498.519000000000005us
I0420 08:26:43.792984 10096 sched.cpp:182] New master at master@67.195.138.60:39863
I0420 08:26:43.795004 10090 master.cpp:646] Registering framework 201304200826-1015726915-39863-10070-0000 at scheduler(32)@67.195.138.60:39863
I0420 08:26:43.795452 10096 sched.cpp:217] Framework registered with 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.795474 10090 hierarchical_allocator_process.hpp:268] Added framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.796407 10090 hierarchical_allocator_process.hpp:660] Found available resources: cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.796929 10090 hierarchical_allocator_process.hpp:686] Offering cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0 to framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.798069 10090 hierarchical_allocator_process.hpp:599] Performed allocation for 1 slaves in 1.673800000000000ms
I0420 08:26:43.798109 10095 master.hpp:309] Adding offer with resources cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.799324 10095 master.cpp:1327] Sending 1 offers to framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.800127 10095 sched.cpp:282] Received 1 offers
I0420 08:26:43.801144 10091 master.cpp:1556] Processing reply for offer 201304200826-1015726915-39863-10070-0 on slave 201304200826-1015726915-39863-10070-0 (janus.apache.org) for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.801848 10091 master.hpp:289] Adding task with resources cpus=2; mem=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.802736 10091 master.cpp:1674] Launching task 0 of framework 201304200826-1015726915-39863-10070-0000 with resources cpus=2; mem=1024 on slave 201304200826-1015726915-39863-10070-0 (janus.apache.org)
I0420 08:26:43.803560 10095 slave.cpp:719] Got assigned task 0 for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.803591 10093 hierarchical_allocator_process.hpp:471] Framework 201304200826-1015726915-39863-10070-0000 left ports=[31000-32000]; disk=1024 unused on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.803591 10091 master.hpp:318] Removing offer with resources cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.804582 10095 slave.cpp:817] Launching task 0 for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.805273 10093 hierarchical_allocator_process.hpp:497] Framework 201304200826-1015726915-39863-10070-0000 filtered slave 201304200826-1015726915-39863-10070-0 for 5.000000000000000secs
I0420 08:26:43.808720 10095 paths.hpp:302] Created executor directory '/tmp/GarbageCollectorIntegrationTest_Unschedule_COZMW2/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/d1c7278b-f8a7-490b-b516-7b0fef5e225e'
I0420 08:26:43.808862 10095 slave.cpp:928] Queuing task '0' for executor default of framework '201304200826-1015726915-39863-10070-0000
I0420 08:26:43.809022 10094 exec.cpp:170] Executor started at: executor(17)@67.195.138.60:39863 with pid 10070
I0420 08:26:43.809303 10095 slave.cpp:512] Successfully attached file '/tmp/GarbageCollectorIntegrationTest_Unschedule_COZMW2/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/d1c7278b-f8a7-490b-b516-7b0fef5e225e'
I0420 08:26:43.810833 10094 slave.cpp:1385] Got registration for executor 'default' of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.810917 10094 slave.cpp:1500] Flushing queued task 0 for executor 'default' of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.811000 10090 exec.cpp:194] Executor registered on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.811759 10090 exec.cpp:258] Executor asked to run task '0'
I0420 08:26:43.812203 10090 exec.cpp:382] Executor sending status update for task 0 in state TASK_RUNNING
I0420 08:26:43.813665 10090 slave.cpp:1729] Handling status update TASK_RUNNING (UUID: a28bae99-cb95-4b87-8cb4-79c5f225d941) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.813797 10095 status_update_manager.cpp:289] Received status update TASK_RUNNING (UUID: a28bae99-cb95-4b87-8cb4-79c5f225d941) for task 0 of framework 201304200826-1015726915-39863-10070-0000 with checkpoint=false
I0420 08:26:43.814225 10095 status_update_manager.cpp:450] Creating StatusUpdate stream for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.814929 10095 status_update_manager.cpp:335] Forwarding status update TASK_RUNNING (UUID: a28bae99-cb95-4b87-8cb4-79c5f225d941) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to the master at master@67.195.138.60:39863
I0420 08:26:43.816123 10093 master.cpp:1086] Status update from (142)@67.195.138.60:39863: task 0 of framework 201304200826-1015726915-39863-10070-0000 is now in state TASK_RUNNING
I0420 08:26:43.816131 10095 slave.cpp:1786] Status update manager successfully handled status update TASK_RUNNING (UUID: a28bae99-cb95-4b87-8cb4-79c5f225d941) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.816611 10094 sched.cpp:327] Received status update TASK_RUNNING (UUID: a28bae99-cb95-4b87-8cb4-79c5f225d941) for task 0 of framework 201304200826-1015726915-39863-10070-0000 from slave(41)@67.195.138.60:39863
I0420 08:26:43.817096 10095 slave.cpp:1792] Sending acknowledgement for status update TASK_RUNNING (UUID: a28bae99-cb95-4b87-8cb4-79c5f225d941) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to executor executor(17)@67.195.138.60:39863
I0420 08:26:43.817704 10094 sched.cpp:360] Sending ACK for status update TASK_RUNNING (UUID: a28bae99-cb95-4b87-8cb4-79c5f225d941) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to slave(41)@67.195.138.60:39863
I0420 08:26:43.818418 10096 exec.cpp:289] Executor received ACK for status update of task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.818805 10093 slave.cpp:1292] Got status update acknowledgement a28bae99-cb95-4b87-8cb4-79c5f225d941 for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.819814 10094 status_update_manager.cpp:360] Received status update acknowledgement a28bae99-cb95-4b87-8cb4-79c5f225d941 for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.819857 10093 slave.cpp:2034] Executor 'default' of framework 201304200826-1015726915-39863-10070-0000 has exited with status '0'
I0420 08:26:43.821743 10093 slave.cpp:1729] Handling status update TASK_LOST (UUID: 2184342c-55c4-43b3-8d79-e6342353407d) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.821949 10094 status_update_manager.cpp:289] Received status update TASK_LOST (UUID: 2184342c-55c4-43b3-8d79-e6342353407d) for task 0 of framework 201304200826-1015726915-39863-10070-0000 with checkpoint=false
I0420 08:26:43.822113 10094 status_update_manager.cpp:335] Forwarding status update TASK_LOST (UUID: 2184342c-55c4-43b3-8d79-e6342353407d) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to the master at master@67.195.138.60:39863
I0420 08:26:43.821992 10095 master.cpp:1188] Executor default of framework 201304200826-1015726915-39863-10070-0000 on slave 201304200826-1015726915-39863-10070-0 (janus.apache.org) exited with status 0
I0420 08:26:43.821969 10093 slave.cpp:1335] Status update manager successfully handled status update acknowledgement a28bae99-cb95-4b87-8cb4-79c5f225d941 for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.823591 10093 slave.cpp:1786] Status update manager successfully handled status update TASK_LOST (UUID: 2184342c-55c4-43b3-8d79-e6342353407d) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.824035 10093 slave.cpp:1792] Sending acknowledgement for status update TASK_LOST (UUID: 2184342c-55c4-43b3-8d79-e6342353407d) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to executor executor(17)@67.195.138.60:39863
I0420 08:26:43.823186 10095 master.cpp:1086] Status update from (142)@67.195.138.60:39863: task 0 of framework 201304200826-1015726915-39863-10070-0000 is now in state TASK_LOST
I0420 08:26:43.825086 10095 master.hpp:300] Removing task with resources cpus=2; mem=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.825098 10094 sched.cpp:327] Received status update TASK_LOST (UUID: 2184342c-55c4-43b3-8d79-e6342353407d) for task 0 of framework 201304200826-1015726915-39863-10070-0000 from slave(41)@67.195.138.60:39863
I0420 08:26:43.826139 10094 sched.cpp:360] Sending ACK for status update TASK_LOST (UUID: 2184342c-55c4-43b3-8d79-e6342353407d) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to slave(41)@67.195.138.60:39863
I0420 08:26:43.825685 10092 hierarchical_allocator_process.hpp:544] Recovered cpus=2; mem=1024 (total allocatable: cpus=2; mem=1024; ports=[31000-32000]; disk=1024) on slave 201304200826-1015726915-39863-10070-0 from framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.826628 10095 slave.cpp:1292] Got status update acknowledgement 2184342c-55c4-43b3-8d79-e6342353407d for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.827671 10095 status_update_manager.cpp:360] Received status update acknowledgement 2184342c-55c4-43b3-8d79-e6342353407d for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.828049 10095 status_update_manager.cpp:481] Cleaning up status update stream for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.828598 10095 slave.cpp:1335] Status update manager successfully handled status update acknowledgement 2184342c-55c4-43b3-8d79-e6342353407d for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.829020 10095 slave.cpp:2169] Cleaning up executor 'default' of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.829669 10091 gc.cpp:56] Scheduling '/tmp/GarbageCollectorIntegrationTest_Unschedule_COZMW2/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/d1c7278b-f8a7-490b-b516-7b0fef5e225e' for removal
I0420 08:26:43.829710 10095 slave.cpp:2233] Cleaning up framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.830509 10096 status_update_manager.cpp:251] Closing status update streams for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.830132 10091 gc.cpp:56] Scheduling '/tmp/GarbageCollectorIntegrationTest_Unschedule_COZMW2/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default' for removal
I0420 08:26:43.831586 10091 gc.cpp:56] Scheduling '/tmp/GarbageCollectorIntegrationTest_Unschedule_COZMW2/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000' for removal
I0420 08:26:43.831707 10092 hierarchical_allocator_process.hpp:660] Found available resources: cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.832468 10092 hierarchical_allocator_process.hpp:686] Offering cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0 to framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.833048 10092 hierarchical_allocator_process.hpp:599] Performed allocation for 1 slaves in 1.352909000000000ms
I0420 08:26:43.833092 10091 master.hpp:309] Adding offer with resources cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.833966 10091 master.cpp:1327] Sending 1 offers to framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.836344 10091 sched.cpp:282] Received 1 offers
I0420 08:26:43.836907 10090 master.cpp:1556] Processing reply for offer 201304200826-1015726915-39863-10070-1 on slave 201304200826-1015726915-39863-10070-0 (janus.apache.org) for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.837322 10090 master.hpp:289] Adding task with resources cpus=2; mem=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.837811 10090 master.cpp:1674] Launching task 0 of framework 201304200826-1015726915-39863-10070-0000 with resources cpus=2; mem=1024 on slave 201304200826-1015726915-39863-10070-0 (janus.apache.org)
I0420 08:26:43.838356 10094 slave.cpp:719] Got assigned task 0 for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.838407 10090 master.hpp:318] Removing offer with resources cpus=2; mem=1024; ports=[31000-32000]; disk=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.838493 10091 hierarchical_allocator_process.hpp:471] Framework 201304200826-1015726915-39863-10070-0000 left ports=[31000-32000]; disk=1024 unused on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.839175 10094 gc.cpp:84] Unscheduling '/tmp/GarbageCollectorIntegrationTest_Unschedule_COZMW2/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000' for removal
I0420 08:26:43.840607 10094 gc.cpp:84] Unscheduling '/tmp/GarbageCollectorIntegrationTest_Unschedule_COZMW2/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default' for removal
I0420 08:26:43.841032 10094 slave.cpp:817] Launching task 0 for framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.842457 10094 paths.hpp:302] Created executor directory '/tmp/GarbageCollectorIntegrationTest_Unschedule_COZMW2/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/5e2cd430-7349-4cc4-868a-36b2701522f0'
I0420 08:26:43.842619 10094 slave.cpp:928] Queuing task '0' for executor default of framework '201304200826-1015726915-39863-10070-0000
I0420 08:26:43.840046 10091 hierarchical_allocator_process.hpp:497] Framework 201304200826-1015726915-39863-10070-0000 filtered slave 201304200826-1015726915-39863-10070-0 for 5.000000000000000secs
I0420 08:26:43.842828 10090 exec.cpp:170] Executor started at: executor(18)@67.195.138.60:39863 with pid 10070
I0420 08:26:43.842895 10094 slave.cpp:512] Successfully attached file '/tmp/GarbageCollectorIntegrationTest_Unschedule_COZMW2/slaves/201304200826-1015726915-39863-10070-0/frameworks/201304200826-1015726915-39863-10070-0000/executors/default/runs/5e2cd430-7349-4cc4-868a-36b2701522f0'
I0420 08:26:43.844476 10094 slave.cpp:1385] Got registration for executor 'default' of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.844993 10094 slave.cpp:1500] Flushing queued task 0 for executor 'default' of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.845026 10096 exec.cpp:194] Executor registered on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.846072 10096 exec.cpp:258] Executor asked to run task '0'
I0420 08:26:43.846671 10096 exec.cpp:382] Executor sending status update for task 0 in state TASK_RUNNING
I0420 08:26:43.848667 10096 slave.cpp:1729] Handling status update TASK_RUNNING (UUID: c9495bd2-e117-4b52-8eed-6a50213be20f) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.848800 10096 status_update_manager.cpp:289] Received status update TASK_RUNNING (UUID: c9495bd2-e117-4b52-8eed-6a50213be20f) for task 0 of framework 201304200826-1015726915-39863-10070-0000 with checkpoint=false
I0420 08:26:43.849853 10096 status_update_manager.cpp:450] Creating StatusUpdate stream for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.851438 10096 status_update_manager.cpp:335] Forwarding status update TASK_RUNNING (UUID: c9495bd2-e117-4b52-8eed-6a50213be20f) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to the master at master@67.195.138.60:39863
I0420 08:26:43.852071 10096 master.cpp:1086] Status update from (142)@67.195.138.60:39863: task 0 of framework 201304200826-1015726915-39863-10070-0000 is now in state TASK_RUNNING
I0420 08:26:43.852110 10090 slave.cpp:1786] Status update manager successfully handled status update TASK_RUNNING (UUID: c9495bd2-e117-4b52-8eed-6a50213be20f) for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.852908 10090 slave.cpp:1792] Sending acknowledgement for status update TASK_RUNNING (UUID: c9495bd2-e117-4b52-8eed-6a50213be20f) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to executor executor(18)@67.195.138.60:39863
I0420 08:26:43.852504 10089 sched.cpp:327] Received status update TASK_RUNNING (UUID: c9495bd2-e117-4b52-8eed-6a50213be20f) for task 0 of framework 201304200826-1015726915-39863-10070-0000 from slave(41)@67.195.138.60:39863
I0420 08:26:43.853885 10089 sched.cpp:360] Sending ACK for status update TASK_RUNNING (UUID: c9495bd2-e117-4b52-8eed-6a50213be20f) for task 0 of framework 201304200826-1015726915-39863-10070-0000 to slave(41)@67.195.138.60:39863
I0420 08:26:43.853395 10096 exec.cpp:289] Executor received ACK for status update of task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.854970 10089 slave.cpp:1292] Got status update acknowledgement c9495bd2-e117-4b52-8eed-6a50213be20f for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.857776 10090 status_update_manager.cpp:360] Received status update acknowledgement c9495bd2-e117-4b52-8eed-6a50213be20f for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.858446 10090 slave.cpp:1335] Status update manager successfully handled status update acknowledgement c9495bd2-e117-4b52-8eed-6a50213be20f for task 0 of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.861814 10070 master.cpp:477] Master terminating
I0420 08:26:43.861889 10070 master.cpp:283] Shutting down master
I0420 08:26:43.861893 10096 slave.cpp:486] Slave asked to shut down by master@67.195.138.60:39863
I0420 08:26:43.861824 10094 sched.cpp:422] Stopping framework '201304200826-1015726915-39863-10070-0000'
I0420 08:26:43.863029 10070 master.hpp:300] Removing task with resources cpus=2; mem=1024 on slave 201304200826-1015726915-39863-10070-0
I0420 08:26:43.863076 10090 hierarchical_allocator_process.hpp:359] Deactivated framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.864846 10096 slave.cpp:1099] Asked to shut down framework 201304200826-1015726915-39863-10070-0000 by master@67.195.138.60:39863
I0420 08:26:43.869001 10096 slave.cpp:1124] Shutting down framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.869791 10096 slave.cpp:2302] Shutting down executor 'default' of framework 201304200826-1015726915-39863-10070-0000
I0420 08:26:43.870561 10096 slave.cpp:441] Slave terminating
I0420 08:26:43.871023 10096 slave.cpp:1099] Asked to shut down framework 201304200826-1015726915-39863-10070-0000 by @0.0.0.0:0
W0420 08:26:43.871497 10096 slave.cpp:1120] Ignoring shutdown framework 201304200826-1015726915-39863-10070-0000 because it is terminating
[ OK ] GarbageCollectorIntegrationTest.Unschedule (92 ms)
[----------] 5 tests from GarbageCollectorIntegrationTest (944 ms total)
[----------] 8 tests from ResourceOffersTest
[ RUN ] ResourceOffersTest.ResourceOfferWithMultipleSlaves
I0420 08:26:43.870579 10091 exec.cpp:321] Executor asked to shutdown
/bin/bash: line 5: 10070 Segmentation fault ${dir}$tst
FAIL: mesos-tests
==================
1 of 1 test failed
==================
make[3]: *** [check-TESTS] Error 1
make[3]: Leaving directory `<https://builds.apache.org/job/Mesos-Trunk-Ubuntu-Build-Out-Of-Src-Disable-Java-Disable-Python-Disable-Webui/ws/build/src'>
make[2]: *** [check-am] Error 2
make[2]: Leaving directory `<https://builds.apache.org/job/Mesos-Trunk-Ubuntu-Build-Out-Of-Src-Disable-Java-Disable-Python-Disable-Webui/ws/build/src'>
make[1]: *** [check] Error 2
make[1]: Leaving directory `<https://builds.apache.org/job/Mesos-Trunk-Ubuntu-Build-Out-Of-Src-Disable-Java-Disable-Python-Disable-Webui/ws/build/src'>
make: *** [check-recursive] Error 1
Build step 'Execute shell' marked build as failure