[
https://issues.apache.org/jira/browse/MESOS-830?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel&focusedCommentId=14641104#comment-14641104
]
Greg Mann commented on MESOS-830:
---------------------------------
I'm currently seeing this issue on OSX, with Java 8 installed via {{brew cask
install java}}:
{noformat}
GLOG_v=2 ./bin/mesos-tests.sh --gtest_filter="ExamplesTest.JavaFramework"
--verbose --gtest_break_on_failure
...
[ RUN ] ExamplesTest.JavaFramework
Using temporary directory '/tmp/ExamplesTest_JavaFramework_GeoV8A'
Enabling authentication for the framework
WARNING: Logging before InitGoogleLogging() is written to STDERR
I0724 13:36:12.288672 180789248 process.cpp:2367] Spawned process
[email protected]:59658
I0724 13:36:12.288795 180789248 process.cpp:2367] Spawned process
[email protected]:59658
I0724 13:36:12.288879 180789248 process.cpp:2367] Spawned process
[email protected]:59658
I0724 13:36:12.288673 784003072 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.288710144+00:00
I0724 13:36:12.288861 786149376 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.288880128+00:00
I0724 13:36:12.288808 782393344 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.288839936+00:00
I0724 13:36:12.288959 180789248 process.cpp:2367] Spawned process
[email protected]:59658
I0724 13:36:12.288980 785076224 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.288999936+00:00
I0724 13:36:12.289037 786149376 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289053952+00:00
I0724 13:36:12.289039 782929920 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289055232+00:00
I0724 13:36:12.289058 180789248 process.cpp:2367] Spawned process
[email protected]:59658
I0724 13:36:12.289150 786149376 process.cpp:2367] Spawned process
__limiter__(1)@10.0.79.73:59658
I0724 13:36:12.289172 785076224 process.cpp:2377] Resuming
__limiter__(1)@10.0.79.73:59658 at 2015-07-24 20:36:12.289180928+00:00
I0724 13:36:12.289196 785076224 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289200128+00:00
I0724 13:36:12.289233 786149376 process.cpp:2367] Spawned process
[email protected]:59658
I0724 13:36:12.289284 784003072 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289297152+00:00
I0724 13:36:12.289331 782929920 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289338112+00:00
I0724 13:36:12.289417 786149376 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289427968+00:00
I0724 13:36:12.289448 784539648 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289460992+00:00
I0724 13:36:12.289479 180789248 process.cpp:2367] Spawned process
[email protected]:59658
I0724 13:36:12.289499 180789248 process.cpp:987] libprocess is initialized on
10.0.79.73:59658 for 8 cpus
I0724 13:36:12.289517 180789248 logging.cpp:177] Logging to STDERR
I0724 13:36:12.289515 786149376 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289522944+00:00
I0724 13:36:12.289801 782393344 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289825792+00:00
I0724 13:36:12.289835 785612800 process.cpp:2377] Resuming
hierarchical-allocator(1)@10.0.79.73:59658 at 2015-07-24
20:36:12.289848064+00:00
I0724 13:36:12.289876 180789248 process.cpp:2367] Spawned process
hierarchical-allocator(1)@10.0.79.73:59658
I0724 13:36:12.289964 180789248 process.cpp:2367] Spawned process
[email protected]:59658
I0724 13:36:12.289970 783466496 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.289984000+00:00
I0724 13:36:12.290007 785076224 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:12.290021888+00:00
I0724 13:36:12.296522 180789248 leveldb.cpp:176] Opened db in 3397us
...
I0724 13:36:17.713187 785612800 pid.cpp:96] Attempting to parse
'slave(2)@10.0.79.73:59658' into a PID
Finished tasks: 1I0724 13:36:17.713224 784539648 slave.cpp:2273] Status update
manager successfully handled status update acknowledgement (UUID:
582d2414-be68-4b03-b496-cebc9378b05a) for task 3 of framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.713215 784003072 process.cpp:2377] Resuming
(14)@10.0.79.73:59658 at 2015-07-24 20:36:17.713229824+00:00
I0724 13:36:17.713225 785612800 master.cpp:3790] Status update TASK_FINISHED
(UUID: c5c8ee27-ac6b-4fa6-ad9d-a3397fae5598) for task 3 of framework
20150724-133612-1229914122-59658-23348-0000 from slave
20150724-133612-1229914122-59658-23348-S0 at slave(2)@10.0.79.73:59658
(10.0.79.73)
I0724 13:36:17.713268 784003072 status_update_manager.cpp:394] Received status
update acknowledgement (UUID: 4795edfd-4df3-44fd-b204-5fe833d35d86) for task 2
of framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.713280 785612800 master.cpp:3829] Forwarding status update
TASK_FINISHED (UUID: c5c8ee27-ac6b-4fa6-ad9d-a3397fae5598) for task 3 of
framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.713286 782393344 sched.cpp:910] Scheduler::statusUpdate took
270us
I0724 13:36:17.713312 782393344 sched.cpp:929] Sending ACK for status update
TASK_FINISHED (UUID: b617ce8c-53a8-45f7-9c37-0ed0e92e860a) for task 4 of
framework 20150724-133612-1229914122-59658-23348-0000 to [email protected]:59658
I0724 13:36:17.713335 782393344 pid.cpp:96] Attempting to parse
'[email protected]:59658' into a PID
I0724 13:36:17.713336 785612800 master.cpp:5219] Updating the latest state of
task 3 of framework 20150724-133612-1229914122-59658-23348-0000 to TASK_FINISHED
I0724 13:36:17.713335 784003072 status_update_manager.cpp:376] Forwarding
update TASK_FINISHED (UUID: 48b79099-0234-4053-a969-c82eb1fcaf22) for task 2 of
framework 20150724-133612-1229914122-59658-23348-0000 to the slave
I0724 13:36:17.713384 782393344 pid.cpp:96] Attempting to parse
'slave(3)@10.0.79.73:59658' into a PID
I0724 13:36:17.713405 782393344 pid.cpp:96] Attempting to parse
'[email protected]:59658' into a PID
I0724 13:36:17.713407 786149376 process.cpp:2377] Resuming
slave(2)@10.0.79.73:59658 at 2015-07-24 20:36:17.713417984+00:00
I0724 13:36:17.713413 783466496 process.cpp:2377] Resuming
hierarchical-allocator(1)@10.0.79.73:59658 at 2015-07-24
20:36:17.713426944+00:00
I0724 13:36:17.713418 782393344 sched.cpp:870] Received status update
TASK_FINISHED (UUID: c1a5027f-b2ea-4df6-a142-b9afb03bbc6a) for task 1 of
framework 20150724-133612-1229914122-59658-23348-0000 from
slave(3)@10.0.79.73:59658
I0724 13:36:17.713448 786149376 slave.cpp:2933] Forwarding the update
TASK_FINISHED (UUID: 48b79099-0234-4053-a969-c82eb1fcaf22) for task 2 of
framework 20150724-133612-1229914122-59658-23348-0000 to [email protected]:59658
I0724 13:36:17.713474 785612800 master.cpp:5287] Removing task 4 with resources
cpus(*):1; mem(*):128 of framework 20150724-133612-1229914122-59658-23348-0000
on slave 20150724-133612-1229914122-59658-23348-S2 at slave(1)@10.0.79.73:59658
(10.0.79.73)
I0724 13:36:17.713505 783466496 hierarchical.hpp:761] Recovered cpus(*):1;
mem(*):128 (total: cpus(*):2; mem(*):10240; disk(*):470816;
ports(*):[31000-32000], allocated: cpus(*):1; mem(*):128) on slave
20150724-133612-1229914122-59658-23348-S0 from framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.713515 786149376 slave.cpp:2273] Status update manager
successfully handled status update acknowledgement (UUID:
4795edfd-4df3-44fd-b204-5fe833d35d86) for task 2 of framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.713546 785612800 master.cpp:3190] Processing ACKNOWLEDGE call
b617ce8c-53a8-45f7-9c37-0ed0e92e860a for task 4 of framework
20150724-133612-1229914122-59658-23348-0000 (Test Framework (Java)) at
[email protected]:59658 on slave
20150724-133612-1229914122-59658-23348-S2
Status update: task 1 is in state TASK_FINISHED
I0724 13:36:17.713595 785076224 process.cpp:2377] Resuming
slave(1)@10.0.79.73:59658 at 2015-07-24 20:36:17.713609984+00:00
Finished tasks: 2I0724 13:36:17.713623 785612800 pid.cpp:96] Attempting to
parse 'slave(2)@10.0.79.73:59658' into a PID
I0724 13:36:17.713656 785612800 master.cpp:3790] Status update TASK_FINISHED
(UUID: 48b79099-0234-4053-a969-c82eb1fcaf22) for task 2 of framework
20150724-133612-1229914122-59658-23348-0000 from slave
20150724-133612-1229914122-59658-23348-S0 at slave(2)@10.0.79.73:59658
(10.0.79.73)
I0724 13:36:17.713666 782393344 sched.cpp:910] Scheduler::statusUpdate took
202us
I0724 13:36:17.713665 783466496 process.cpp:2377] Resuming (6)@10.0.79.73:59658
at 2015-07-24 20:36:17.713680896+00:00
I0724 13:36:17.713685 785612800 master.cpp:3829] Forwarding status update
TASK_FINISHED (UUID: 48b79099-0234-4053-a969-c82eb1fcaf22) for task 2 of
framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.713696 782393344 sched.cpp:929] Sending ACK for status update
TASK_FINISHED (UUID: c1a5027f-b2ea-4df6-a142-b9afb03bbc6a) for task 1 of
framework 20150724-133612-1229914122-59658-23348-0000 to [email protected]:59658
I0724 13:36:17.713711 783466496 status_update_manager.cpp:394] Received status
update acknowledgement (UUID: b617ce8c-53a8-45f7-9c37-0ed0e92e860a) for task 4
of framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.713726 782393344 pid.cpp:96] Attempting to parse
'[email protected]:59658' into a PID
I0724 13:36:17.713760 785612800 master.cpp:5219] Updating the latest state of
task 2 of framework 20150724-133612-1229914122-59658-23348-0000 to TASK_FINISHED
I0724 13:36:17.713775 783466496 status_update_manager.cpp:530] Cleaning up
status update stream for task 4 of framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.713789 782393344 pid.cpp:96] Attempting to parse
'slave(3)@10.0.79.73:59658' into a PID
I0724 13:36:17.713815 782393344 pid.cpp:96] Attempting to parse
'[email protected]:59658' into a PID
I0724 13:36:17.713804 784003072 process.cpp:2377] Resuming
hierarchical-allocator(1)@10.0.79.73:59658 at 2015-07-24
20:36:17.713815808+00:00
I0724 13:36:17.713832 782393344 sched.cpp:870] Received status update
TASK_FINISHED (UUID: d4dd479f-9f3c-4b0a-a30d-9f24018fecd2) for task 0 of
framework 20150724-133612-1229914122-59658-23348-0000 from
slave(3)@10.0.79.73:59658
I0724 13:36:17.713871 785612800 master.cpp:5287] Removing task 1 with resources
cpus(*):1; mem(*):128 of framework 20150724-133612-1229914122-59658-23348-0000
on slave 20150724-133612-1229914122-59658-23348-S1 at slave(3)@10.0.79.73:59658
(10.0.79.73)
I0724 13:36:17.713891 786149376 process.cpp:2377] Resuming
slave(1)@10.0.79.73:59658 at 2015-07-24 20:36:17.713920000+00:00
I0724 13:36:17.713924 784003072 hierarchical.hpp:761] Recovered cpus(*):1;
mem(*):128 (total: cpus(*):2; mem(*):10240; disk(*):470816;
ports(*):[31000-32000], allocated: ) on slave
20150724-133612-1229914122-59658-23348-S0 from framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.713934 786149376 slave.cpp:2273] Status update manager
successfully handled status update acknowledgement (UUID:
b617ce8c-53a8-45f7-9c37-0ed0e92e860a) for task 4 of framework
20150724-133612-1229914122-59658-23348-0000
Status update: task 0 is in state TASK_FINISHEDI0724 13:36:17.713937 785612800
master.cpp:3190] Processing ACKNOWLEDGE call
c1a5027f-b2ea-4df6-a142-b9afb03bbc6a for task 1 of framework
20150724-133612-1229914122-59658-23348-0000 (Test Framework (Java)) at
[email protected]:59658 on slave
20150724-133612-1229914122-59658-23348-S1
I0724 13:36:17.713968 786149376 slave.cpp:5087] Completing task 4
Finished tasks: 3
I0724 13:36:17.713990 786149376 process.cpp:2377] Resuming
slave(3)@10.0.79.73:59658 at 2015-07-24 20:36:17.713999872+00:00
I0724 13:36:17.714015 782393344 sched.cpp:910] Scheduler::statusUpdate took
167us
I0724 13:36:17.714035 782393344 sched.cpp:929] Sending ACK for status update
TASK_FINISHED (UUID: d4dd479f-9f3c-4b0a-a30d-9f24018fecd2) for task 0 of
framework 20150724-133612-1229914122-59658-23348-0000 to [email protected]:59658
I0724 13:36:17.714035 784003072 process.cpp:2377] Resuming
(22)@10.0.79.73:59658 at 2015-07-24 20:36:17.714048000+00:00
I0724 13:36:17.714058 782393344 pid.cpp:96] Attempting to parse
'[email protected]:59658' into a PID
I0724 13:36:17.714066 784003072 status_update_manager.cpp:394] Received status
update acknowledgement (UUID: c1a5027f-b2ea-4df6-a142-b9afb03bbc6a) for task 1
of framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.714118 784003072 status_update_manager.cpp:530] Cleaning up
status update stream for task 1 of framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.714125 785076224 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:17.714135808+00:00
I0724 13:36:17.714143 782393344 pid.cpp:96] Attempting to parse
'slave(2)@10.0.79.73:59658' into a PID
I0724 13:36:17.714164 782393344 pid.cpp:96] Attempting to parse
'[email protected]:59658' into a PID
I0724 13:36:17.714175 782393344 sched.cpp:870] Received status update
TASK_FINISHED (UUID: c5c8ee27-ac6b-4fa6-ad9d-a3397fae5598) for task 3 of
framework 20150724-133612-1229914122-59658-23348-0000 from
slave(2)@10.0.79.73:59658
I0724 13:36:17.714181 785076224 master.cpp:5287] Removing task 0 with resources
cpus(*):1; mem(*):128 of framework 20150724-133612-1229914122-59658-23348-0000
on slave 20150724-133612-1229914122-59658-23348-S1 at slave(3)@10.0.79.73:59658
(10.0.79.73)
I0724 13:36:17.714210 785612800 process.cpp:2377] Resuming
slave(3)@10.0.79.73:59658 at 2015-07-24 20:36:17.714221056+00:00
I0724 13:36:17.714234 785612800 slave.cpp:2273] Status update manager
successfully handled status update acknowledgement (UUID:
c1a5027f-b2ea-4df6-a142-b9afb03bbc6a) for task 1 of framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.714252 785612800 slave.cpp:5087] Completing task 1
I0724 13:36:17.714244 785076224 master.cpp:3190] Processing ACKNOWLEDGE call
d4dd479f-9f3c-4b0a-a30d-9f24018fecd2 for task 0 of framework
20150724-133612-1229914122-59658-23348-0000 (Test Framework (Java)) at
[email protected]:59658 on slave
20150724-133612-1229914122-59658-23348-S1
I0724 13:36:17.714287 784539648 process.cpp:2377] Resuming
slave(3)@10.0.79.73:59658 at 2015-07-24 20:36:17.714298880+00:00
Status update: task 3 is in state TASK_FINISHED
Finished tasks: 4
I0724 13:36:17.714360 782393344 sched.cpp:910] Scheduler::statusUpdate took
169us
I0724 13:36:17.714383 782393344 sched.cpp:929] Sending ACK for status update
TASK_FINISHED (UUID: c5c8ee27-ac6b-4fa6-ad9d-a3397fae5598) for task 3 of
framework 20150724-133612-1229914122-59658-23348-0000 to [email protected]:59658
I0724 13:36:17.714378 786149376 process.cpp:2377] Resuming
(22)@10.0.79.73:59658 at 2015-07-24 20:36:17.714391040+00:00
I0724 13:36:17.714413 782393344 pid.cpp:96] Attempting to parse
'[email protected]:59658' into a PID
I0724 13:36:17.714417 786149376 status_update_manager.cpp:394] Received status
update acknowledgement (UUID: d4dd479f-9f3c-4b0a-a30d-9f24018fecd2) for task 0
of framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.714462 786149376 status_update_manager.cpp:530] Cleaning up
status update stream for task 0 of framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.714462 783466496 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:17.714471936+00:00
I0724 13:36:17.714479 782393344 pid.cpp:96] Attempting to parse
'slave(2)@10.0.79.73:59658' into a PID
I0724 13:36:17.714498 782393344 pid.cpp:96] Attempting to parse
'[email protected]:59658' into a PID
I0724 13:36:17.714509 782393344 sched.cpp:870] Received status update
TASK_FINISHED (UUID: 48b79099-0234-4053-a969-c82eb1fcaf22) for task 2 of
framework 20150724-133612-1229914122-59658-23348-0000 from
slave(2)@10.0.79.73:59658
I0724 13:36:17.714519 783466496 master.cpp:5287] Removing task 3 with resources
cpus(*):1; mem(*):128 of framework 20150724-133612-1229914122-59658-23348-0000
on slave 20150724-133612-1229914122-59658-23348-S0 at slave(2)@10.0.79.73:59658
(10.0.79.73)
I0724 13:36:17.714545 784003072 process.cpp:2377] Resuming
slave(3)@10.0.79.73:59658 at 2015-07-24 20:36:17.714564096+00:00
I0724 13:36:17.714578 783466496 master.cpp:3190] Processing ACKNOWLEDGE call
c5c8ee27-ac6b-4fa6-ad9d-a3397fae5598 for task 3 of framework
20150724-133612-1229914122-59658-23348-0000 (Test Framework (Java)) at
[email protected]:59658 on slave
20150724-133612-1229914122-59658-23348-S0
I0724 13:36:17.714591 784003072 slave.cpp:2273] Status update manager
successfully handled status update acknowledgement (UUID:
d4dd479f-9f3c-4b0a-a30d-9f24018fecd2) for task 0 of framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.714612 784003072 slave.cpp:5087] Completing task 0
Status update: task 2 is in state TASK_FINISHEDI0724 13:36:17.714622 785612800
process.cpp:2377] Resuming slave(2)@10.0.79.73:59658 at 2015-07-24
20:36:17.714635008+00:00
Finished tasks: 5
I0724 13:36:17.714720 782929920 process.cpp:2377] Resuming
(14)@10.0.79.73:59658 at 2015-07-24 20:36:17.714732800+00:00
I0724 13:36:17.714747 782929920 status_update_manager.cpp:394] Received status
update acknowledgement (UUID: c5c8ee27-ac6b-4fa6-ad9d-a3397fae5598) for task 3
of framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.714771 782393344 sched.cpp:1752] Asked to stop the driver
I0724 13:36:17.714803 782929920 status_update_manager.cpp:530] Cleaning up
status update stream for task 3 of framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.714823 782393344 sched.cpp:910] Scheduler::statusUpdate took
300us
I0724 13:36:17.714841 782393344 sched.cpp:917] Not sending status update
acknowledgment message because the driver is not running!
I0724 13:36:17.714854 782393344 sched.cpp:1032] Stopping framework
'20150724-133612-1229914122-59658-23348-0000'
I0724 13:36:17.714874 782393344 pid.cpp:96] Attempting to parse
'[email protected]:59658' into a PID
I0724 13:36:17.714887 785076224 process.cpp:2377] Resuming
slave(2)@10.0.79.73:59658 at 2015-07-24 20:36:17.714909184+00:00
I0724 13:36:17.714906 784539648 process.cpp:2377] Resuming
[email protected]:59658 at 2015-07-24 20:36:17.714916864+00:00
I0724 13:36:17.714936 782393344 process.cpp:2482] Cleaning up
[email protected]:59658
I0724 13:36:17.714936 785076224 slave.cpp:2273] Status update manager
successfully handled status update acknowledgement (UUID:
c5c8ee27-ac6b-4fa6-ad9d-a3397fae5598) for task 3 of framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.714982 784539648 master.cpp:4759] Removing framework
20150724-133612-1229914122-59658-23348-0000 (Test Framework (Java)) at
[email protected]:59658
I0724 13:36:17.714990 785076224 slave.cpp:5087] Completing task 3
I0724 13:36:17.715044 782929920 process.cpp:2377] Resuming
hierarchical-allocator(1)@10.0.79.73:59658 at 2015-07-24
20:36:17.715066880+00:00
I0724 13:36:17.715077 784003072 process.cpp:2377] Resuming
slave(1)@10.0.79.73:59658 at 2015-07-24 20:36:17.715086080+00:00
I0724 13:36:17.715096 180789248 sched.cpp:1752] Asked to stop the driver
I0724 13:36:17.715098 782929920 hierarchical.hpp:469] Deactivated framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.715112 180789248 sched.cpp:1755] Ignoring stop because the
status of the driver is DRIVER_STOPPED
I0724 13:36:17.715132 784003072 slave.cpp:1946] Asked to shut down framework
20150724-133612-1229914122-59658-23348-0000 by [email protected]:59658
I0724 13:36:17.715145 784003072 slave.cpp:1971] Shutting down framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.715136 782929920 process.cpp:2377] Resuming
slave(3)@10.0.79.73:59658 at 2015-07-24 20:36:17.715148800+00:00
I0724 13:36:17.715176 784003072 slave.cpp:3674] Shutting down executor
'default' of framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.715172 782929920 slave.cpp:1946] Asked to shut down framework
20150724-133612-1229914122-59658-23348-0000 by [email protected]:59658
I0724 13:36:17.715206 782929920 slave.cpp:1971] Shutting down framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.715201 783466496 process.cpp:2377] Resuming
slave(2)@10.0.79.73:59658 at 2015-07-24 20:36:17.715212032+00:00
I0724 13:36:17.715234 782929920 slave.cpp:3674] Shutting down executor
'default' of framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.715234 783466496 slave.cpp:1946] Asked to shut down framework
20150724-133612-1229914122-59658-23348-0000 by [email protected]:59658
I0724 13:36:17.715239 784539648 master.cpp:5219] Updating the latest state of
task 2 of framework 20150724-133612-1229914122-59658-23348-0000 to TASK_KILLED
I0724 13:36:17.715263 783466496 slave.cpp:1971] Shutting down framework
20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.715287 783466496 slave.cpp:3674] Shutting down executor
'default' of framework 20150724-133612-1229914122-59658-23348-0000
I0724 13:36:17.715275 784539648 master.cpp:5287] Removing task 2 with resources
cpus(*):1; mem(*):128 of framework 20150724-133612-1229914122-59658-23348-0000
on slave 20150724-133612-1229914122-59658-23348-S0 at slave(2)@10.0.79.73:59658
(10.0.79.73)
I0724 13:36:17.715472 784539648 master.cpp:5316] Removing executor 'default'
with resources of framework 20150724-133612-1229914122-59658-23348-0000 on
slave 20150724-133612-1229914122-59658-23348-S2 at slave(1)@10.0.79.73:59658
(10.0.79.73)
I0724 13:36:17.715533 785612800 process.cpp:2377] Resuming
hierarchical-allocator(1)@10.0.79.73:59658 at 2015-07-24
20:36:17.715544832+00:00
I0724 13:36:17.715623 784539648 master.cpp:5316] Removing executor 'default'
with resources of framework 20150724-133612-1229914122-59658-23348-0000 on
slave 20150724-133612-1229914122-59658-23348-S0 at slave(2)@10.0.79.73:59658
(10.0.79.73)
I0724 13:36:17.715641 883953664 pid.cpp:96] Attempting to parse
'slave(1)@10.0.79.73:59658' into a PID
I0724 13:36:17.715679 883953664 process.cpp:567] Parsed message name
'mesos.internal.ShutdownExecutorMessage' for executor(1)@10.0.79.73:59660 from
slave(1)@10.0.79.73:59658
I0724 13:36:17.715747 883417088 process.cpp:2377] Resuming
executor(1)@10.0.79.73:59660 at 2015-07-24 20:36:17.715760896+00:00
I0724 13:36:17.715795 883417088 exec.cpp:379] Executor asked to shutdown
I0724 13:36:17.715751 880734208 process.cpp:2377] Resuming
[email protected]:59660 at 2015-07-24 20:36:17.715763200+00:00
I0724 13:36:17.715847 883953664 process.cpp:2367] Spawned process
__http__(5)@10.0.79.73:59660
I0724 13:36:17.715857 882343936 process.cpp:2377] Resuming
__http__(5)@10.0.79.73:59660 at 2015-07-24 20:36:17.715864832+00:00
I0724 13:36:17.715863 883417088 process.cpp:2367] Spawned process
(1)@10.0.79.73:59660
I0724 13:36:17.715880 881807360 process.cpp:2377] Resuming (1)@10.0.79.73:59660
at 2015-07-24 20:36:17.715895808+00:00
E0724 13:36:17.715914 883953664 socket.hpp:173] Shutdown failed on fd=22:
Socket is not connected [57]
I0724 13:36:17.715920 881807360 exec.cpp:78] Scheduling shutdown of the executor
I0724 13:36:17.715996 882880512 process.cpp:2377] Resuming
__http__(5)@10.0.79.73:59660 at 2015-07-24 20:36:17.716044800+00:00
I0724 13:36:17.716073 882880512 process.cpp:2482] Cleaning up
__http__(5)@10.0.79.73:59660
I0724 13:36:17.716092 883417088 exec.cpp:394] Executor::shutdown took 172us
I0724 13:36:17.716115 880197632 process.cpp:2377] Resuming
[email protected]:59660 at 2015-07-24 20:36:17.716134912+00:00
I0724 13:36:22.718369 882343936 process.cpp:2377] Resuming (1)@10.0.79.73:59660
at 2015-07-24 20:36:22.718429952+00:00
I0724 13:36:22.720269 882343936 exec.cpp:86] Committing suicide by killing the
process group
../../src/tests/script.cpp:83: Failure
Failed
java_framework_test.sh terminated with signal Abort trap: 6
*** Aborted at 1437770183 (unix time) try "date -d @1437770183" if you are
using GNU date ***
E0724 13:36:23.295542 890601472 socket.hpp:173] Shutdown failed on fd=20:
Socket is not connected [57]
E0724 13:36:23.295799 870559744 socket.hpp:173] Shutdown failed on fd=16:
Socket is not connected [57]
I0724 13:36:23.295758 867876864 process.cpp:2377] Resuming
executor(1)@10.0.79.73:59661 at 2015-07-24 20:36:23.295820032+00:00
I0724 13:36:23.295918 867876864 exec.cpp:461] Slave exited ... shutting down
E0724 13:36:23.295928 890601472 socket.hpp:173] Shutdown failed on fd=16:
Socket is not connected [57]
E0724 13:36:23.295935 870559744 socket.hpp:173] Shutdown failed on fd=20:
Socket is not connected [57]
I0724 13:36:23.295904 887382016 process.cpp:2377] Resuming
executor(1)@10.0.79.73:59662 at 2015-07-24 20:36:23.295960064+00:00
I0724 13:36:23.296028 868950016 process.cpp:2377] Resuming
[email protected]:59661 at 2015-07-24 20:36:23.296041984+00:00
I0724 13:36:23.296066 887382016 exec.cpp:461] Slave exited ... shutting down
I0724 13:36:23.296039 866267136 process.cpp:2377] Resuming (1)@10.0.79.73:59661
at 2015-07-24 20:36:23.296052992+00:00
I0724 13:36:23.296066 867876864 process.cpp:2367] Spawned process
(1)@10.0.79.73:59661
I0724 13:36:23.296087 866267136 exec.cpp:78] Scheduling shutdown of the executor
I0724 13:36:23.296136 887382016 process.cpp:2367] Spawned process
(1)@10.0.79.73:59662
I0724 13:36:23.296140 886845440 process.cpp:2377] Resuming
[email protected]:59662 at 2015-07-24 20:36:23.296152064+00:00
I0724 13:36:23.296146 888455168 process.cpp:2377] Resuming (1)@10.0.79.73:59662
at 2015-07-24 20:36:23.296160000+00:00
I0724 13:36:23.296176 888455168 exec.cpp:78] Scheduling shutdown of the executor
I0724 13:36:23.296452 887382016 exec.cpp:478] Executor::shutdown took 298us
I0724 13:36:23.296453 867876864 exec.cpp:478] Executor::shutdown took 352us
PC: @ 0x104dd67e1 testing::UnitTest::AddTestPartResult()
*** SIGSEGV (@0x0) received by PID 23333 (TID 0x7fff73b6b300) stack trace: ***
@ 0x7fff87738f1a _sigtramp
@ 0x71 (unknown)
@ 0x104dd62d1 testing::internal::AssertHelper::operator=()
@ 0x104b5ddd1 mesos::internal::tests::execute()
@ 0x10414b9d3 ExamplesTest_JavaFramework_Test::TestBody()
@ 0x104e1dd13
testing::internal::HandleSehExceptionsInMethodIfSupported<>()
@ 0x104e05ee7
testing::internal::HandleExceptionsInMethodIfSupported<>()
@ 0x104ddfa15 testing::Test::Run()
@ 0x104de09cb testing::TestInfo::Run()
@ 0x104de15b7 testing::TestCase::Run()
@ 0x104de88e9 testing::internal::UnitTestImpl::RunAllTests()
@ 0x104e198f3
testing::internal::HandleSehExceptionsInMethodIfSupported<>()
@ 0x104e07ea7
testing::internal::HandleExceptionsInMethodIfSupported<>()
@ 0x104de8554 testing::UnitTest::Run()
@ 0x1045ad005 main
@ 0x7fff916ba5c9 start
@ 0x4 (unknown)
I0724 13:36:28.301734 867340288 process.cpp:2377] Resuming (1)@10.0.79.73:59661
at 2015-07-24 20:36:28.301833984+00:00
I0724 13:36:28.301920 867340288 exec.cpp:86] Committing suicide by killing the
process group
I0724 13:36:28.301787 886308864 process.cpp:2377] Resuming (1)@10.0.79.73:59662
at 2015-07-24 20:36:28.301893120+00:00
I0724 13:36:28.301985 886308864 exec.cpp:86] Committing suicide by killing the
process group
Segmentation fault: 11 (core dumped)
{noformat}
> ExamplesTest.JavaFramework is flaky
> -----------------------------------
>
> Key: MESOS-830
> URL: https://issues.apache.org/jira/browse/MESOS-830
> Project: Mesos
> Issue Type: Bug
> Components: test
> Reporter: Vinod Kone
> Labels: flaky
>
> [ RUN ] ExamplesTest.JavaFramework
> Using temporary directory '/tmp/ExamplesTest_JavaFramework_wSc7u8'
> Enabling authentication for the framework
> I1120 15:13:39.820032 1681264640 master.cpp:285] Master started on
> 172.25.133.171:52576
> I1120 15:13:39.820180 1681264640 master.cpp:299] Master ID:
> 201311201513-2877626796-52576-3234
> I1120 15:13:39.820194 1681264640 master.cpp:302] Master only allowing
> authenticated frameworks to register!
> I1120 15:13:39.821197 1679654912 slave.cpp:112] Slave started on
> 1)@172.25.133.171:52576
> I1120 15:13:39.821795 1679654912 slave.cpp:212] Slave resources: cpus(*):4;
> mem(*):7168; disk(*):481998; ports(*):[31000-32000]
> I1120 15:13:39.822855 1682337792 slave.cpp:112] Slave started on
> 2)@172.25.133.171:52576
> I1120 15:13:39.823652 1682337792 slave.cpp:212] Slave resources: cpus(*):4;
> mem(*):7168; disk(*):481998; ports(*):[31000-32000]
> I1120 15:13:39.825330 1679118336 master.cpp:744] The newly elected leader is
> [email protected]:52576
> I1120 15:13:39.825445 1679118336 master.cpp:748] Elected as the leading
> master!
> I1120 15:13:39.825907 1681264640 state.cpp:33] Recovering state from
> '/tmp/ExamplesTest_JavaFramework_wSc7u8/0/meta'
> I1120 15:13:39.826127 1681264640 status_update_manager.cpp:180] Recovering
> status update manager
> I1120 15:13:39.826331 1681801216 process_isolator.cpp:317] Recovering isolator
> I1120 15:13:39.826738 1682874368 slave.cpp:2743] Finished recovery
> I1120 15:13:39.827747 1682337792 state.cpp:33] Recovering state from
> '/tmp/ExamplesTest_JavaFramework_wSc7u8/1/meta'
> I1120 15:13:39.827945 1680191488 slave.cpp:112] Slave started on
> 3)@172.25.133.171:52576
> I1120 15:13:39.828415 1682337792 status_update_manager.cpp:180] Recovering
> status update manager
> I1120 15:13:39.828608 1680728064 sched.cpp:260] Authenticating with master
> [email protected]:52576
> I1120 15:13:39.828606 1680191488 slave.cpp:212] Slave resources: cpus(*):4;
> mem(*):7168; disk(*):481998; ports(*):[31000-32000]
> I1120 15:13:39.828680 1682874368 slave.cpp:497] New master detected at
> [email protected]:52576
> I1120 15:13:39.828765 1682337792 process_isolator.cpp:317] Recovering isolator
> I1120 15:13:39.829828 1680728064 sched.cpp:229] Detecting new master
> I1120 15:13:39.830288 1679654912 authenticatee.hpp:100] Initializing client
> SASL
> I1120 15:13:39.831635 1680191488 state.cpp:33] Recovering state from
> '/tmp/ExamplesTest_JavaFramework_wSc7u8/2/meta'
> I1120 15:13:39.831991 1679118336 status_update_manager.cpp:158] New master
> detected at [email protected]:52576
> I1120 15:13:39.832042 1682874368 slave.cpp:524] Detecting new master
> I1120 15:13:39.832314 1682337792 slave.cpp:2743] Finished recovery
> I1120 15:13:39.832309 1681264640 master.cpp:1266] Attempting to register
> slave on vkone.local at slave(1)@172.25.133.171:52576
> I1120 15:13:39.832929 1680728064 status_update_manager.cpp:180] Recovering
> status update manager
> I1120 15:13:39.833371 1681801216 slave.cpp:497] New master detected at
> [email protected]:52576
> I1120 15:13:39.833273 1681264640 master.cpp:2513] Adding slave
> 201311201513-2877626796-52576-3234-0 at vkone.local with cpus(*):4;
> mem(*):7168; disk(*):481998; ports(*):[31000-32000]
> I1120 15:13:39.833595 1680728064 process_isolator.cpp:317] Recovering isolator
> I1120 15:13:39.833859 1681801216 slave.cpp:524] Detecting new master
> I1120 15:13:39.833861 1682874368 status_update_manager.cpp:158] New master
> detected at [email protected]:52576
> I1120 15:13:39.834092 1680191488 slave.cpp:542] Registered with master
> [email protected]:52576; given slave ID
> 201311201513-2877626796-52576-3234-0
> I1120 15:13:39.834486 1681264640 master.cpp:1266] Attempting to register
> slave on vkone.local at slave(2)@172.25.133.171:52576
> I1120 15:13:39.834549 1681264640 master.cpp:2513] Adding slave
> 201311201513-2877626796-52576-3234-1 at vkone.local with cpus(*):4;
> mem(*):7168; disk(*):481998; ports(*):[31000-32000]
> I1120 15:13:39.834750 1680191488 slave.cpp:555] Checkpointing SlaveInfo to
> '/tmp/ExamplesTest_JavaFramework_wSc7u8/0/meta/slaves/201311201513-2877626796-52576-3234-0/slave.info'
> I1120 15:13:39.834875 1682874368 hierarchical_allocator_process.hpp:445]
> Added slave 201311201513-2877626796-52576-3234-0 (vkone.local) with
> cpus(*):4; mem(*):7168; disk(*):481998; ports(*):[31000-32000] (and
> cpus(*):4; mem(*):7168; disk(*):481998; ports(*):[31000-32000] available)
> I1120 15:13:39.835155 1680728064 slave.cpp:542] Registered with master
> [email protected]:52576; given slave ID
> 201311201513-2877626796-52576-3234-1
> I1120 15:13:39.835458 1679118336 slave.cpp:2743] Finished recovery
> I1120 15:13:39.835739 1680728064 slave.cpp:555] Checkpointing SlaveInfo to
> '/tmp/ExamplesTest_JavaFramework_wSc7u8/1/meta/slaves/201311201513-2877626796-52576-3234-1/slave.info'
> I1120 15:13:39.835922 1682874368 hierarchical_allocator_process.hpp:445]
> Added slave 201311201513-2877626796-52576-3234-1 (vkone.local) with
> cpus(*):4; mem(*):7168; disk(*):481998; ports(*):[31000-32000] (and
> cpus(*):4; mem(*):7168; disk(*):481998; ports(*):[31000-32000] available)
> I1120 15:13:39.836120 1681264640 slave.cpp:497] New master detected at
> [email protected]:52576
> I1120 15:13:39.836340 1679118336 status_update_manager.cpp:158] New master
> detected at [email protected]:52576
> I1120 15:13:39.836436 1681264640 slave.cpp:524] Detecting new master
> I1120 15:13:39.836629 1682874368 master.cpp:1266] Attempting to register
> slave on vkone.local at slave(3)@172.25.133.171:52576
> I1120 15:13:39.836653 1682874368 master.cpp:2513] Adding slave
> 201311201513-2877626796-52576-3234-2 at vkone.local with cpus(*):4;
> mem(*):7168; disk(*):481998; ports(*):[31000-32000]
> I1120 15:13:39.836804 1680728064 slave.cpp:542] Registered with master
> [email protected]:52576; given slave ID
> 201311201513-2877626796-52576-3234-2
> I1120 15:13:39.837190 1680728064 slave.cpp:555] Checkpointing SlaveInfo to
> '/tmp/ExamplesTest_JavaFramework_wSc7u8/2/meta/slaves/201311201513-2877626796-52576-3234-2/slave.info'
> I1120 15:13:39.837569 1682874368 hierarchical_allocator_process.hpp:445]
> Added slave 201311201513-2877626796-52576-3234-2 (vkone.local) with
> cpus(*):4; mem(*):7168; disk(*):481998; ports(*):[31000-32000] (and
> cpus(*):4; mem(*):7168; disk(*):481998; ports(*):[31000-32000] available)
> I1120 15:13:39.852011 1679654912 authenticatee.hpp:124] Creating new client
> SASL connection
> I1120 15:13:39.852219 1680191488 master.cpp:1734] Authenticating framework at
> scheduler(1)@172.25.133.171:52576
> I1120 15:13:39.852577 1682337792 authenticator.hpp:83] Initializing server
> SASL
> I1120 15:13:39.856160 1682337792 authenticator.hpp:140] Creating new server
> SASL connection
> I1120 15:13:39.856334 1681264640 authenticatee.hpp:212] Received SASL
> authentication mechanisms: CRAM-MD5
> I1120 15:13:39.856360 1681264640 authenticatee.hpp:238] Attempting to
> authenticate with mechanism 'CRAM-MD5'
> I1120 15:13:39.856421 1681264640 authenticator.hpp:243] Received SASL
> authentication start
> I1120 15:13:39.856487 1681264640 authenticator.hpp:325] Authentication
> requires more steps
> I1120 15:13:39.856531 1681264640 authenticatee.hpp:258] Received SASL
> authentication step
> I1120 15:13:39.856576 1681264640 authenticator.hpp:271] Received SASL
> authentication step
> I1120 15:13:39.856643 1681264640 authenticator.hpp:317] Authentication success
> I1120 15:13:39.856724 1681264640 authenticatee.hpp:298] Authentication success
> I1120 15:13:39.856768 1681264640 master.cpp:1774] Successfully authenticated
> framework at scheduler(1)@172.25.133.171:52576
> I1120 15:13:39.857028 1681264640 sched.cpp:334] Successfully authenticated
> with master [email protected]:52576
> I1120 15:13:39.857139 1681264640 master.cpp:798] Received registration
> request from scheduler(1)@172.25.133.171:52576
> I1120 15:13:39.857306 1681264640 master.cpp:816] Registering framework
> 201311201513-2877626796-52576-3234-0000 at scheduler(1)@172.25.133.171:52576
> I1120 15:13:39.862296 1680191488 hierarchical_allocator_process.hpp:332]
> Added framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.863867 1680191488 master.cpp:1700] Sending 3 offers to
> framework 201311201513-2877626796-52576-3234-0000
> Registered! ID = 201311201513-2877626796-52576-3234-0000
> Launching task 0
> Launching task 1
> Launching task 2
> I1120 15:13:39.905390 1680191488 master.cpp:2026] Processing reply for offer
> 201311201513-2877626796-52576-3234-0 on slave
> 201311201513-2877626796-52576-3234-1 (vkone.local) for framework
> 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.905825 1680191488 master.hpp:400] Adding task 0 with resources
> cpus(*):1; mem(*):128 on slave 201311201513-2877626796-52576-3234-1
> (vkone.local)
> I1120 15:13:39.905886 1680191488 master.cpp:2150] Launching task 0 of
> framework 201311201513-2877626796-52576-3234-0000 with resources cpus(*):1;
> mem(*):128 on slave 201311201513-2877626796-52576-3234-1 (vkone.local)
> I1120 15:13:39.906422 1680191488 master.cpp:2026] Processing reply for offer
> 201311201513-2877626796-52576-3234-1 on slave
> 201311201513-2877626796-52576-3234-2 (vkone.local) for framework
> 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.906664 1680191488 master.hpp:400] Adding task 1 with resources
> cpus(*):1; mem(*):128 on slave 201311201513-2877626796-52576-3234-2
> (vkone.local)
> I1120 15:13:39.906721 1680191488 master.cpp:2150] Launching task 1 of
> framework 201311201513-2877626796-52576-3234-0000 with resources cpus(*):1;
> mem(*):128 on slave 201311201513-2877626796-52576-3234-2 (vkone.local)
> I1120 15:13:39.907171 1680191488 master.cpp:2026] Processing reply for offer
> 201311201513-2877626796-52576-3234-2 on slave
> 201311201513-2877626796-52576-3234-0 (vkone.local) for framework
> 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.907419 1680191488 master.hpp:400] Adding task 2 with resources
> cpus(*):1; mem(*):128 on slave 201311201513-2877626796-52576-3234-0
> (vkone.local)
> I1120 15:13:39.907480 1680191488 master.cpp:2150] Launching task 2 of
> framework 201311201513-2877626796-52576-3234-0000 with resources cpus(*):1;
> mem(*):128 on slave 201311201513-2877626796-52576-3234-0 (vkone.local)
> I1120 15:13:39.907938 1680191488 slave.cpp:722] Got assigned task 0 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.908473 1680191488 slave.cpp:833] Launching task 0 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.914427 1682874368 slave.cpp:722] Got assigned task 1 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.914594 1680728064 slave.cpp:722] Got assigned task 2 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.914844 1681801216 hierarchical_allocator_process.hpp:590]
> Framework 201311201513-2877626796-52576-3234-0000 filtered slave
> 201311201513-2877626796-52576-3234-1 for 1secs
> I1120 15:13:39.915292 1682874368 slave.cpp:833] Launching task 1 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.915424 1681801216 hierarchical_allocator_process.hpp:590]
> Framework 201311201513-2877626796-52576-3234-0000 filtered slave
> 201311201513-2877626796-52576-3234-2 for 1secs
> I1120 15:13:39.915685 1681801216 hierarchical_allocator_process.hpp:590]
> Framework 201311201513-2877626796-52576-3234-0000 filtered slave
> 201311201513-2877626796-52576-3234-0 for 1secs
> I1120 15:13:39.915828 1680728064 slave.cpp:833] Launching task 2 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.917840 1680191488 slave.cpp:943] Queuing task '0' for executor
> default of framework '201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.917935 1679118336 process_isolator.cpp:100] Launching default
> (/Users/vinod/workspace/apache/mesos/build/src/examples/java/test-executor)
> in
> /tmp/ExamplesTest_JavaFramework_wSc7u8/1/slaves/201311201513-2877626796-52576-3234-1/frameworks/201311201513-2877626796-52576-3234-0000/executors/default/runs/375b31a9-7093-4db1-964d-e6b425b1e4b4
> with resources ' for framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.922019 1679118336 process_isolator.cpp:163] Forked executor at
> 3268
> I1120 15:13:39.922703 1679118336 slave.cpp:2073] Monitoring executor default
> of framework 201311201513-2877626796-52576-3234-0000 forked at pid 3268
> I1120 15:13:39.929134 1682874368 slave.cpp:943] Queuing task '1' for executor
> default of framework '201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.929323 1682874368 process_isolator.cpp:100] Launching default
> (/Users/vinod/workspace/apache/mesos/build/src/examples/java/test-executor)
> in
> /tmp/ExamplesTest_JavaFramework_wSc7u8/2/slaves/201311201513-2877626796-52576-3234-2/frameworks/201311201513-2877626796-52576-3234-0000/executors/default/runs/2bd0e75d-a2b9-4ae6-be08-9782612309a5
> with resources ' for framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.931243 1682874368 process_isolator.cpp:163] Forked executor at
> 3269
> I1120 15:13:39.931612 1681801216 slave.cpp:2073] Monitoring executor default
> of framework 201311201513-2877626796-52576-3234-0000 forked at pid 3269
> E1120 15:13:39.931836 1681801216 slave.cpp:2099] Failed to watch executor
> default of framework 201311201513-2877626796-52576-3234-0000: Already watched
> I1120 15:13:39.936460 1680728064 slave.cpp:943] Queuing task '2' for executor
> default of framework '201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.936619 1681801216 process_isolator.cpp:100] Launching default
> (/Users/vinod/workspace/apache/mesos/build/src/examples/java/test-executor)
> in
> /tmp/ExamplesTest_JavaFramework_wSc7u8/0/slaves/201311201513-2877626796-52576-3234-0/frameworks/201311201513-2877626796-52576-3234-0000/executors/default/runs/16d600da-da86-4614-91cb-58a7b27ab534
> with resources ' for framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:39.941299 1681801216 process_isolator.cpp:163] Forked executor at
> 3270
> I1120 15:13:39.942179 1681801216 slave.cpp:2073] Monitoring executor default
> of framework 201311201513-2877626796-52576-3234-0000 forked at pid 3270
> E1120 15:13:39.942395 1681801216 slave.cpp:2099] Failed to watch executor
> default of framework 201311201513-2877626796-52576-3234-0000: Already watched
> Fetching resources into
> '/tmp/ExamplesTest_JavaFramework_wSc7u8/2/slaves/201311201513-2877626796-52576-3234-2/frameworks/201311201513-2877626796-52576-3234-0000/executors/default/runs/2bd0e75d-a2b9-4ae6-be08-9782612309a5'
> Fetching resources into
> '/tmp/ExamplesTest_JavaFramework_wSc7u8/1/slaves/201311201513-2877626796-52576-3234-1/frameworks/201311201513-2877626796-52576-3234-0000/executors/default/runs/375b31a9-7093-4db1-964d-e6b425b1e4b4'
> Fetching resources into
> '/tmp/ExamplesTest_JavaFramework_wSc7u8/0/slaves/201311201513-2877626796-52576-3234-0/frameworks/201311201513-2877626796-52576-3234-0000/executors/default/runs/16d600da-da86-4614-91cb-58a7b27ab534'
> I1120 15:13:40.372573 1681801216 slave.cpp:1406] Got registration for
> executor 'default' of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.373258 1681801216 slave.cpp:1527] Flushing queued task 1 for
> executor 'default' of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.388317 1681801216 slave.cpp:1406] Got registration for
> executor 'default' of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.388983 1681801216 slave.cpp:1527] Flushing queued task 0 for
> executor 'default' of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.398084 1679654912 slave.cpp:1406] Got registration for
> executor 'default' of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.399344 1679654912 slave.cpp:1527] Flushing queued task 2 for
> executor 'default' of framework 201311201513-2877626796-52576-3234-0000
> Registered executor on vkone.local
> I1120 15:13:40.491843 1679654912 slave.cpp:1740] Handling status update
> TASK_RUNNING (UUID: f04b1852-3669-444a-906f-3675f784c14f) for task 1 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52577
> I1120 15:13:40.492202 1679654912 status_update_manager.cpp:305] Received
> status update TASK_RUNNING (UUID: f04b1852-3669-444a-906f-3675f784c14f) for
> task 1 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.492424 1679654912 status_update_manager.cpp:356] Forwarding
> status update TASK_RUNNING (UUID: f04b1852-3669-444a-906f-3675f784c14f) for
> task 1 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> Registered executor on vkone.local
> I1120 15:13:40.492671 1682337792 master.cpp:1452] Status update TASK_RUNNING
> (UUID: f04b1852-3669-444a-906f-3675f784c14f) for task 1 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(3)@172.25.133.171:52576
> I1120 15:13:40.492735 1682337792 slave.cpp:1865] Sending acknowledgement for
> status update TASK_RUNNING (UUID: f04b1852-3669-444a-906f-3675f784c14f) for
> task 1 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52577
> Status update: task 1 is in state TASK_RUNNING
> I1120 15:13:40.502235 1679654912 status_update_manager.cpp:380] Received
> status update acknowledgement (UUID: f04b1852-3669-444a-906f-3675f784c14f)
> for task 1 of framework 201311201513-2877626796-52576-3234-0000
> Registered executor on vkone.local
> I1120 15:13:40.531292 1679654912 slave.cpp:1740] Handling status update
> TASK_RUNNING (UUID: c19b6a5a-19ce-4613-8a5a-08fe807ff27c) for task 2 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52579
> I1120 15:13:40.532091 1680728064 status_update_manager.cpp:305] Received
> status update TASK_RUNNING (UUID: c19b6a5a-19ce-4613-8a5a-08fe807ff27c) for
> task 2 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.532305 1680728064 status_update_manager.cpp:356] Forwarding
> status update TASK_RUNNING (UUID: c19b6a5a-19ce-4613-8a5a-08fe807ff27c) for
> task 2 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> I1120 15:13:40.532776 1682874368 slave.cpp:1865] Sending acknowledgement for
> status update TASK_RUNNING (UUID: c19b6a5a-19ce-4613-8a5a-08fe807ff27c) for
> task 2 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52579
> I1120 15:13:40.532951 1681801216 master.cpp:1452] Status update TASK_RUNNING
> (UUID: c19b6a5a-19ce-4613-8a5a-08fe807ff27c) for task 2 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(1)@172.25.133.171:52576
> Status update: task 2 is in state TASK_RUNNING
> I1120 15:13:40.538895 1682874368 status_update_manager.cpp:380] Received
> status update acknowledgement (UUID: c19b6a5a-19ce-4613-8a5a-08fe807ff27c)
> for task 2 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.541267 1682874368 slave.cpp:1740] Handling status update
> TASK_RUNNING (UUID: c218b0c3-d77c-4901-8570-391c330ba117) for task 0 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52578
> I1120 15:13:40.541555 1682874368 status_update_manager.cpp:305] Received
> status update TASK_RUNNING (UUID: c218b0c3-d77c-4901-8570-391c330ba117) for
> task 0 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.541725 1682874368 status_update_manager.cpp:356] Forwarding
> status update TASK_RUNNING (UUID: c218b0c3-d77c-4901-8570-391c330ba117) for
> task 0 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> I1120 15:13:40.542196 1682874368 master.cpp:1452] Status update TASK_RUNNING
> (UUID: c218b0c3-d77c-4901-8570-391c330ba117) for task 0 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(2)@172.25.133.171:52576
> I1120 15:13:40.542251 1682874368 slave.cpp:1865] Sending acknowledgement for
> status update TASK_RUNNING (UUID: c218b0c3-d77c-4901-8570-391c330ba117) for
> task 0 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52578
> Status update: task 0 is in state TASK_RUNNING
> I1120 15:13:40.545537 1682874368 status_update_manager.cpp:380] Received
> status update acknowledgement (UUID: c218b0c3-d77c-4901-8570-391c330ba117)
> for task 0 of framework 201311201513-2877626796-52576-3234-0000
> Running task value: "1"
> I1120 15:13:40.764219 1682337792 slave.cpp:1740] Handling status update
> TASK_FINISHED (UUID: 4a163594-146a-46f7-bd43-f906e76ad84c) for task 1 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52577
> I1120 15:13:40.764629 1682337792 status_update_manager.cpp:305] Received
> status update TASK_FINISHED (UUID: 4a163594-146a-46f7-bd43-f906e76ad84c) for
> task 1 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.764698 1682337792 status_update_manager.cpp:356] Forwarding
> status update TASK_FINISHED (UUID: 4a163594-146a-46f7-bd43-f906e76ad84c) for
> task 1 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> I1120 15:13:40.765043 1682337792 master.cpp:1452] Status update TASK_FINISHED
> (UUID: 4a163594-146a-46f7-bd43-f906e76ad84c) for task 1 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(3)@172.25.133.171:52576
> I1120 15:13:40.765192 1682337792 master.hpp:418] Removing task 1 with
> resources cpus(*):1; mem(*):128 on slave 2Status update: task 1 is in state
> TASK_FINISHED
> Finished tasks: 1
> 01311201513-2877626796-52576-3234-2 (vkone.local)
> I1120 15:13:40.765363 1679118336 slave.cpp:1865] Sending acknowledgement for
> status update TASK_FINISHED (UUID: 4a163594-146a-46f7-bd43-f906e76ad84c) for
> task 1 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52577
> I1120 15:13:40.772738 1682337792 hierarchical_allocator_process.hpp:637]
> Recovered cpus(*):1; mem(*):128 (total allocatable: cpus(*):4; mem(*):7168;
> disk(*):481998; ports(*):[31000-32000]) on slave
> 201311201513-2877626796-52576-3234-2 from framework
> 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.773190 1679118336 status_update_manager.cpp:380] Received
> status update acknowledgement (UUID: 4a163594-146a-46f7-bd43-f906e76ad84c)
> for task 1 of framework 201311201513-2877626796-52576-3234-0000
> Running task value: "0"
> Running task value: "2"
> I1120 15:13:40.790068 1679118336 slave.cpp:1740] Handling status update
> TASK_FINISHED (UUID: 13265a94-50f1-4bc4-b2e2-9f60a1bb4086) for task 0 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52578
> I1120 15:13:40.790411 1680728064 status_update_manager.cpp:305] Received
> status update TASK_FINISHED (UUID: 13265a94-50f1-4bc4-b2e2-9f60a1bb4086) for
> task 0 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.790493 1680728064 status_update_manager.cpp:356] Forwarding
> status update TASK_FINISHED (UUID: 13265a94-50f1-4bc4-b2e2-9f60a1bb4086) for
> task 0 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> I1120 15:13:40.790674 1679118336 master.cpp:1452] Status update TASK_FINISHED
> (UUID: 13265a94-50f1-4bc4-b2e2-9f60a1bb4086) for task 0 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(2)@172.25.133.171:52576
> I1120 15:13:40.790798 1679118336 master.hpp:418] Removing task 0 with
> resources cpus(*):1; mem(*):128 on slave 201311201513-2877626796-52576-3234-1
> (vkone.local)
> I1120 15:13:40.790928 1679118336 slave.cpp:1865] Sending acknowledgement for
> status update TASK_FINISHED (UUID: 13265a94-50f1-4bc4-b2e2-9f60a1bb4086) for
> task 0 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52578
> Status update: task 0 is in state TASK_FINISHED
> Finished tasks: 2
> I1120 15:13:40.791225 1680191488 hierarchical_allocator_process.hpp:637]
> Recovered cpus(*):1; mem(*):128 (total allocatable: cpus(*):4; mem(*):7168;
> disk(*):481998; ports(*):[31000-32000]) on slave
> 201311201513-2877626796-52576-3234-1 from framework
> 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.794234 1679118336 status_update_manager.cpp:380] Received
> status update acknowledgement (UUID: 13265a94-50f1-4bc4-b2e2-9f60a1bb4086)
> for task 0 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.795830 1681801216 slave.cpp:1740] Handling status update
> TASK_FINISHED (UUID: f6f28e88-5ea6-4519-ba92-65ead6236fff) for task 2 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52579
> I1120 15:13:40.796111 1679118336 status_update_manager.cpp:305] Received
> status update TASK_FINISHED (UUID: f6f28e88-5ea6-4519-ba92-65ead6236fff) for
> task 2 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.796182 1679118336 status_update_manager.cpp:356] Forwarding
> status update TASK_FINISHED (UUID: f6f28e88-5ea6-4519-ba92-65ead6236fff) for
> task 2 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> I1120 15:13:40.796352 1680728064 master.cpp:1452] Status update TASK_FINISHED
> (UUID: f6f28e88-5ea6-4519-ba92-65ead6236fff) for task 2 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(1)@172.25.133.171:52576
> I1120 15:13:40.796398 1679118336 slave.cpp:1865] Sending acknowledgement for
> status update TASK_FINISHED (UUID: f6f28e88-5ea6-4519-ba92-65ead6236fff) for
> task 2 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52579
> I1120 15:13:40.796466 1680728064 master.hpp:418] Removing task 2 with
> resources cpus(*):1; mem(*):128 on slave 201311201513-2877626796-52576-3234-0
> (vkone.local)
> I1120 15:13:40.796707 1679118336 hierarchical_allocator_process.hpp:637]
> Recovered cpus(*):1; mem(*):128 (total allocatable: cpus(*):4; mem(*):7168;
> disk(*):481998; ports(*):[31000-32000]) on slave
> 201311201513-2877626796-52576-3234-0 from framework
> 201311201513-2877626796-52576-3234-0000
> Status update: task 2 is in state TASK_FINISHED
> Finished tasks: 3
> I1120 15:13:40.797384 1680728064 status_update_manager.cpp:380] Received
> status update acknowledgement (UUID: f6f28e88-5ea6-4519-ba92-65ead6236fff)
> for task 2 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.824383 1681801216 master.cpp:1700] Sending 3 offers to
> framework 201311201513-2877626796-52576-3234-0000
> Launching task 3
> Launching task 4
> I1120 15:13:40.826971 1679118336 master.cpp:2026] Processing reply for offer
> 201311201513-2877626796-52576-3234-3 on slave
> 201311201513-2877626796-52576-3234-1 (vkone.local) for framework
> 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.827268 1679118336 master.hpp:400] Adding task 3 with resources
> cpus(*):1; mem(*):128 on slave 201311201513-2877626796-52576-3234-1
> (vkone.local)
> I1120 15:13:40.827348 1679118336 master.cpp:2150] Launching task 3 of
> framework 201311201513-2877626796-52576-3234-0000 with resources cpus(*):1;
> mem(*):128 on slave 201311201513-2877626796-52576-3234-1 (vkone.local)
> I1120 15:13:40.827487 1680728064 slave.cpp:722] Got assigned task 3 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.827857 1680728064 slave.cpp:833] Launching task 3 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.827913 1679118336 master.cpp:2026] Processing reply for offer
> 201311201513-2877626796-52576-3234-4 on slave
> 201311201513-2877626796-52576-3234-2 (vkone.local) for framework
> 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.827986 1680728064 slave.cpp:968] Sending task '3' to executor
> 'default' of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.828126 1679118336 master.hpp:400] Adding task 4 with resources
> cpus(*):1; mem(*):128 on slave 201311201513-2877626796-52576-3234-2
> (vkone.local)
> I1120 15:13:40.828187 1679118336 master.cpp:2150] Launching task 4 of
> framework 201311201513-2877626796-52576-3234-0000 with resources cpus(*):1;
> mem(*):128 on slave 201311201513-2877626796-52576-3234-2 (vkone.local)
> I1120 15:13:40.828632 1679118336 master.cpp:2026] Processing reply for offer
> 201311201513-2877626796-52576-3234-5 on slave
> 201311201513-2877626796-52576-3234-0 (vkone.local) for framework
> 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.828655 1680728064 hierarchical_allocator_process.hpp:590]
> Framework 201311201513-2877626796-52576-3234-0000 filtered slave
> 201311201513-2877626796-52576-3234-1 for 1secs
> I1120 15:13:40.829005 1679118336 slave.cpp:722] Got assigned task 4 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.829027 1680728064 hierarchical_allocator_process.hpp:590]
> Framework 201311201513-2877626796-52576-3234-0000 filtered slave
> 201311201513-2877626796-52576-3234-2 for 1secs
> I1120 15:13:40.829260 1679118336 slave.cpp:833] Launching task 4 for
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.829273 1680728064 hierarchical_allocator_process.hpp:590]
> Framework 201311201513-2877626796-52576-3234-0000 filtered slave
> 201311201513-2877626796-52576-3234-0 for 1secs
> I1120 15:13:40.829390 1679118336 slave.cpp:968] Sending task '4' to executor
> 'default' of framework 201311201513-2877626796-52576-3234-0000
> Running task value: "3"
> Running task value: "4"
> I1120 15:13:40.839279 1682337792 slave.cpp:1740] Handling status update
> TASK_RUNNING (UUID: a8d02ae6-3138-441c-a004-465d879b1277) for task 3 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52578
> I1120 15:13:40.839534 1679118336 status_update_manager.cpp:305] Received
> status update TASK_RUNNING (UUID: a8d02ae6-3138-441c-a004-465d879b1277) for
> task 3 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.839705 1679118336 status_update_manager.cpp:356] Forwarding
> status update TASK_RUNNING (UUID: a8d02ae6-3138-441c-a004-465d879b1277) for
> task 3 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> I1120 15:13:40.839944 1682337792 master.cpp:1452] Status update TASK_RUNNING
> (UUID: a8d02ae6-3138-441c-a004-465d879b1277) for task 3 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(2)@172.25.133.171:52576
> Status update: task 3 is in state TASK_RUNNING
> I1120 15:13:40.839947 1679118336 slave.cpp:1865] Sending acknowledgement for
> status update TASK_RUNNING (UUID: a8d02ae6-3138-441c-a004-465d879b1277) for
> task 3 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52578
> I1120 15:13:40.856334 1679118336 slave.cpp:1740] Handling status update
> TASK_FINISHED (UUID: 3fc45cb8-fd7f-4bed-a21d-76f234af6b36) for task 3 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52578
> I1120 15:13:40.856650 1679118336 status_update_manager.cpp:380] Received
> status update acknowledgement (UUID: a8d02ae6-3138-441c-a004-465d879b1277)
> for task 3 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.856818 1679118336 status_update_manager.cpp:305] Received
> status update TASK_FINISHED (UUID: 3fc45cb8-fd7f-4bed-a21d-76f234af6b36) for
> task 3 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.856875 1679118336 status_update_manager.cpp:356] Forwarding
> status update TASK_FINISHED (UUID: 3fc45cb8-fd7f-4bed-a21d-76f234af6b36) for
> task 3 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> I1120 15:13:40.857105 1679118336 slave.cpp:1740] Handling status update
> TASK_RUNNING (UUID: 4f97c8df-1cc0-4eeb-8469-9d72df09ec73) for task 4 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52577
> I1120 15:13:40.857369 1679118336 slave.cpp:1865] Sending acknowledgement for
> status update TASK_FINISHED (UUID: 3fc45cb8-fd7f-4bed-a21d-76f234af6b36) for
> task 3 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52578
> I1120 15:13:40.857498 1680728064 status_update_manager.cpp:305] Received
> status update TASK_RUNNING (UUID: 4f97c8df-1cc0-4eeb-8469-9d72df09ec73) for
> task 4 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.857518 1682337792 master.cpp:1452] Status update TASK_FINISHED
> (UUID: 3fc45cb8-fd7f-4bed-a21d-76f234af6b36) for task 3 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(2)@172.25.133.171:52576
> I1120 15:13:40.857635 1680728064 status_update_manager.cpp:356] Forwarding
> status update TASK_RUNNING (UUID: 4f97c8df-1cc0-4eeb-8469-9d72df09ec73) for
> task 4 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> I1120 15:13:40.857630 1682337792 master.hpp:418] Removing task 3 with
> resources cpus(*):1; mem(*):128 on slave 201311201513-2877626796-52576-3234-1
> (vkone.local)
> I1120 15:13:40.857843 1682337792 master.cpp:1452] Status update TASK_RUNNING
> (UUID: 4f97c8df-1cc0-4eeb-8469-9d72df09ec73) for task 4 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(3)@172.25.133.171:52576
> I1120 15:13:40.858043 1680728064 hierarchical_allocator_process.hpp:637]
> Recovered cpus(*):1; mem(*):128 (total allocatable: cpus(*):4; mem(*):7168;
> disk(*):481998; ports(*):[31000-32000]) on slave
> 201311201513-2877626796-52576-3234-1 from framework
> 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.858098 1680728064 slave.cpp:1865] Sending acknowledgement for
> status update TASK_RUNNING (UUID: 4f97c8df-1cc0-4eeb-8469-9d72df09ec73) for
> task 4 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52577
> Status update: task 3 is in state TASK_FINISHED
> Finished tasks: 4
> Status update: task 4 is in state TASK_RUNNING
> I1120 15:13:40.858896 1682337792 status_update_manager.cpp:380] Received
> status update acknowledgement (UUID: 3fc45cb8-fd7f-4bed-a21d-76f234af6b36)
> for task 3 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.858957 1680728064 status_update_manager.cpp:380] Received
> status update acknowledgement (UUID: 4f97c8df-1cc0-4eeb-8469-9d72df09ec73)
> for task 4 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.859905 1679654912 slave.cpp:1740] Handling status update
> TASK_FINISHED (UUID: 876d7ddc-5d58-48df-a590-d82cf39d4978) for task 4 of
> framework 201311201513-2877626796-52576-3234-0000 from
> executor(1)@172.25.133.171:52577
> I1120 15:13:40.860174 1680728064 status_update_manager.cpp:305] Received
> status update TASK_FINISHED (UUID: 876d7ddc-5d58-48df-a590-d82cf39d4978) for
> task 4 of framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.860245 1680728064 status_update_manager.cpp:356] Forwarding
> status update TASK_FINISHED (UUID: 876d7ddc-5d58-48df-a590-d82cf39d4978) for
> task 4 of framework 201311201513-2877626796-52576-3234-0000 to
> [email protected]:52576
> I1120 15:13:40.860437 1679654912 master.cpp:1452] Status update TASK_FINISHED
> (UUID: 876d7ddc-5d58-48df-a590-d82cf39d4978) for task 4 of framework
> 201311201513-2877626796-52576-3234-0000 from slave(3)@172.25.133.171:52576
> I1120 15:13:40.860486 1680728064 slave.cpp:1865] Sending acknowledgement for
> status update TASK_FINISHED (UUID: 876d7ddc-5d58-48df-a590-d82cf39d4978) for
> task 4 of framework 201311201513-2877626796-52576-3234-0000 to
> executor(1)@172.25.133.171:52577
> I1120 15:13:40.860550 1679654912 master.hpp:418] Removing task 4 with
> resources cpus(*):1; mem(Status update: task 4 is in state TASK_FINISHED
> Finished tasks: 5
> *):128 on slave 201311201513-2877626796-52576-3234-2 (vkone.local)
> I1120 15:13:40.863689 1679654912 master.cpp:996] Asked to unregister
> framework 201311201513-2877626796-52576-3234-0000
> I1120 15:13:40.863750 1679654912 master.cpp:2385] Removing framework
> 201311201513-2877626796-52576-3234-0000
> ../../src/tests/script.cpp:81: Failure
> Failed
> java_framework_test.sh terminated with signal 'Abort trap: 6'
> [ FAILED ] ExamplesTest.JavaFramework (2688 ms)
> [----------] 1 test from ExamplesTest (2688 ms total)
> [----------] Global test environment tear-down
> [==========] 1 test from 1 test case ran. (2692 ms total)
> [ PASSED ] 0 tests.
> [ FAILED ] 1 test, listed below:
> [ FAILED ] ExamplesTest.JavaFramework
--
This message was sent by Atlassian JIRA
(v6.3.4#6332)