You are viewing a plain text version of this content. The canonical link for it is here.
Posted to builds@mesos.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2015/11/20 13:08:23 UTC
Build failed in Jenkins: Mesos » gcc,--verbose,ubuntu:14.04,docker||Hadoop #1249
See <https://builds.apache.org/job/Mesos/COMPILER=gcc,CONFIGURATION=--verbose,OS=ubuntu%3A14.04,label_exp=docker%7C%7CHadoop/1249/changes>
Changes:
[benjamin.mahler] Restored the ABORT message in Subprocess to show the execvpe path.
------------------------------------------
[...truncated 140216 lines...]
I1120 12:08:25.244694 29833 slave.cpp:2009] Asked to shut down framework 2319667c-dde4-4f05-b5bd-8d9dce373512-0000 by @0.0.0.0:0
I1120 12:08:25.244734 29833 slave.cpp:2034] Shutting down framework 2319667c-dde4-4f05-b5bd-8d9dce373512-0000
I1120 12:08:25.244807 29833 slave.cpp:3657] Cleaning up executor 'default' of framework 2319667c-dde4-4f05-b5bd-8d9dce373512-0000 at executor(132)@172.17.5.188:41228
I1120 12:08:25.245301 29838 gc.cpp:56] Scheduling '/tmp/ContentType_SchedulerTest_Message_1_j02Pv2/slaves/2319667c-dde4-4f05-b5bd-8d9dce373512-S0/frameworks/2319667c-dde4-4f05-b5bd-8d9dce373512-0000/executors/default/runs/12eebe8b-4a1f-4516-a73c-8e68a526c6d8' for gc 6.99999716431704days in the future
I1120 12:08:25.245405 29833 slave.cpp:3745] Cleaning up framework 2319667c-dde4-4f05-b5bd-8d9dce373512-0000
I1120 12:08:25.245801 29838 gc.cpp:56] Scheduling '/tmp/ContentType_SchedulerTest_Message_1_j02Pv2/slaves/2319667c-dde4-4f05-b5bd-8d9dce373512-S0/frameworks/2319667c-dde4-4f05-b5bd-8d9dce373512-0000/executors/default' for gc 6.99999716053037days in the future
I1120 12:08:25.245858 29833 status_update_manager.cpp:284] Closing status update streams for framework 2319667c-dde4-4f05-b5bd-8d9dce373512-0000
I1120 12:08:25.246083 29833 status_update_manager.cpp:530] Cleaning up status update stream for task e046ed13-d6f5-4ea1-ba62-99337755a5ad of framework 2319667c-dde4-4f05-b5bd-8d9dce373512-0000
I1120 12:08:25.246162 29838 gc.cpp:56] Scheduling '/tmp/ContentType_SchedulerTest_Message_1_j02Pv2/slaves/2319667c-dde4-4f05-b5bd-8d9dce373512-S0/frameworks/2319667c-dde4-4f05-b5bd-8d9dce373512-0000' for gc 6.99999715612148days in the future
[ OK ] ContentType/SchedulerTest.Message/1 (123 ms)
[ RUN ] ContentType/SchedulerTest.Request/0
I1120 12:08:25.261420 29806 leveldb.cpp:176] Opened db in 3.502393ms
I1120 12:08:25.262426 29806 leveldb.cpp:183] Compacted db in 939509ns
I1120 12:08:25.262498 29806 leveldb.cpp:198] Created db iterator in 24099ns
I1120 12:08:25.262514 29806 leveldb.cpp:204] Seeked to beginning of db in 1985ns
I1120 12:08:25.262526 29806 leveldb.cpp:273] Iterated through 0 keys in the db in 403ns
I1120 12:08:25.262579 29806 replica.cpp:780] Replica recovered with log positions 0 -> 0 with 1 holes and 0 unlearned
I1120 12:08:25.264700 29825 recover.cpp:449] Starting replica recovery
I1120 12:08:25.265362 29838 recover.cpp:475] Replica is in EMPTY status
I1120 12:08:25.266561 29839 master.cpp:367] Master 0fdff1f7-cb45-4d58-b44c-cba92980cf0f (a51e6bb03b55) started on 172.17.5.188:41228
I1120 12:08:25.266968 29839 master.cpp:369] Flags at startup: --acls="" --allocation_interval="1secs" --allocator="HierarchicalDRF" --authenticate="false" --authenticate_slaves="true" --authenticators="crammd5" --authorizers="local" --credentials="/tmp/n5mcWN/credentials" --framework_sorter="drf" --help="false" --hostname_lookup="true" --initialize_driver_logging="true" --log_auto_initialize="true" --logbufsecs="0" --logging_level="INFO" --max_slave_ping_timeouts="5" --quiet="false" --recovery_slave_removal_limit="100%" --registry="replicated_log" --registry_fetch_timeout="1mins" --registry_store_timeout="25secs" --registry_strict="true" --root_submissions="true" --slave_ping_timeout="15secs" --slave_reregister_timeout="10mins" --user_sorter="drf" --version="false" --webui_dir="/mesos/mesos-0.26.0/_inst/share/mesos/webui" --work_dir="/tmp/n5mcWN/master" --zk_session_timeout="10secs"
I1120 12:08:25.267544 29839 master.cpp:416] Master allowing unauthenticated frameworks to register
I1120 12:08:25.267655 29839 master.cpp:419] Master only allowing authenticated slaves to register
I1120 12:08:25.267861 29839 credentials.hpp:37] Loading credentials for authentication from '/tmp/n5mcWN/credentials'
I1120 12:08:25.268374 29839 master.cpp:458] Using default 'crammd5' authenticator
I1120 12:08:25.268813 29839 master.cpp:495] Authorization enabled
I1120 12:08:25.270114 29831 hierarchical.cpp:153] Initialized hierarchical allocator process
I1120 12:08:25.270238 29832 whitelist_watcher.cpp:79] No whitelist given
I1120 12:08:25.273159 29830 replica.cpp:676] Replica in EMPTY status received a broadcasted recover request from (10652)@172.17.5.188:41228
I1120 12:08:25.274507 29826 master.cpp:1612] The newly elected leader is master@172.17.5.188:41228 with id 0fdff1f7-cb45-4d58-b44c-cba92980cf0f
I1120 12:08:25.274543 29826 master.cpp:1625] Elected as the leading master!
I1120 12:08:25.274565 29826 master.cpp:1385] Recovering from registrar
I1120 12:08:25.274737 29832 registrar.cpp:309] Recovering registrar
I1120 12:08:25.275318 29825 recover.cpp:195] Received a recover response from a replica in EMPTY status
I1120 12:08:25.275924 29835 recover.cpp:566] Updating replica status to STARTING
I1120 12:08:25.276911 29834 leveldb.cpp:306] Persisting metadata (8 bytes) to leveldb took 639134ns
I1120 12:08:25.276939 29834 replica.cpp:323] Persisted replica status to STARTING
I1120 12:08:25.277170 29830 recover.cpp:475] Replica is in STARTING status
I1120 12:08:25.277897 29835 replica.cpp:676] Replica in STARTING status received a broadcasted recover request from (10653)@172.17.5.188:41228
I1120 12:08:25.278224 29838 recover.cpp:195] Received a recover response from a replica in STARTING status
I1120 12:08:25.278658 29829 recover.cpp:566] Updating replica status to VOTING
I1120 12:08:25.279116 29833 leveldb.cpp:306] Persisting metadata (8 bytes) to leveldb took 335505ns
I1120 12:08:25.279165 29833 replica.cpp:323] Persisted replica status to VOTING
I1120 12:08:25.279280 29835 recover.cpp:580] Successfully joined the Paxos group
I1120 12:08:25.279451 29835 recover.cpp:464] Recover process terminated
I1120 12:08:25.279813 29840 log.cpp:661] Attempting to start the writer
I1120 12:08:25.280889 29831 replica.cpp:496] Replica received implicit promise request from (10654)@172.17.5.188:41228 with proposal 1
I1120 12:08:25.281239 29831 leveldb.cpp:306] Persisting metadata (8 bytes) to leveldb took 317389ns
I1120 12:08:25.281260 29831 replica.cpp:345] Persisted promised to 1
I1120 12:08:25.281833 29831 coordinator.cpp:240] Coordinator attempting to fill missing positions
I1120 12:08:25.282922 29834 replica.cpp:391] Replica received explicit promise request from (10655)@172.17.5.188:41228 for position 0 with proposal 2
I1120 12:08:25.283283 29834 leveldb.cpp:343] Persisting action (8 bytes) to leveldb took 310419ns
I1120 12:08:25.283306 29834 replica.cpp:715] Persisted action at 0
I1120 12:08:25.284307 29830 replica.cpp:540] Replica received write request for position 0 from (10656)@172.17.5.188:41228
I1120 12:08:25.284361 29830 leveldb.cpp:438] Reading position from leveldb took 25959ns
I1120 12:08:25.284759 29830 leveldb.cpp:343] Persisting action (14 bytes) to leveldb took 318966ns
I1120 12:08:25.284781 29830 replica.cpp:715] Persisted action at 0
I1120 12:08:25.285614 29828 replica.cpp:694] Replica received learned notice for position 0 from @0.0.0.0:0
I1120 12:08:25.285972 29828 leveldb.cpp:343] Persisting action (16 bytes) to leveldb took 328385ns
I1120 12:08:25.285995 29828 replica.cpp:715] Persisted action at 0
I1120 12:08:25.286011 29828 replica.cpp:700] Replica learned NOP action at position 0
I1120 12:08:25.286556 29829 log.cpp:677] Writer started with ending position 0
I1120 12:08:25.287538 29835 leveldb.cpp:438] Reading position from leveldb took 24256ns
I1120 12:08:25.288455 29828 registrar.cpp:342] Successfully fetched the registry (0B) in 13.659904ms
I1120 12:08:25.288599 29828 registrar.cpp:441] Applied 1 operations in 37161ns; attempting to update the 'registry'
I1120 12:08:25.289547 29825 log.cpp:685] Attempting to append 176 bytes to the log
I1120 12:08:25.289702 29838 coordinator.cpp:350] Coordinator attempting to write APPEND action at position 1
I1120 12:08:25.290585 29838 replica.cpp:540] Replica received write request for position 1 from (10657)@172.17.5.188:41228
I1120 12:08:25.291069 29838 leveldb.cpp:343] Persisting action (195 bytes) to leveldb took 431244ns
I1120 12:08:25.291213 29838 replica.cpp:715] Persisted action at 1
I1120 12:08:25.292366 29828 replica.cpp:694] Replica received learned notice for position 1 from @0.0.0.0:0
I1120 12:08:25.293129 29828 leveldb.cpp:343] Persisting action (197 bytes) to leveldb took 698963ns
I1120 12:08:25.293159 29828 replica.cpp:715] Persisted action at 1
I1120 12:08:25.293192 29828 replica.cpp:700] Replica learned APPEND action at position 1
I1120 12:08:25.294412 29832 registrar.cpp:486] Successfully updated the 'registry' in 5.730816ms
I1120 12:08:25.294682 29832 registrar.cpp:372] Successfully recovered registrar
I1120 12:08:25.294744 29837 log.cpp:704] Attempting to truncate the log to 1
I1120 12:08:25.294958 29837 coordinator.cpp:350] Coordinator attempting to write TRUNCATE action at position 2
I1120 12:08:25.295354 29832 master.cpp:1422] Recovered 0 slaves from the Registry (137B) ; allowing 10mins for slaves to re-register
I1120 12:08:25.296303 29833 replica.cpp:540] Replica received write request for position 2 from (10658)@172.17.5.188:41228
I1120 12:08:25.296737 29833 leveldb.cpp:343] Persisting action (16 bytes) to leveldb took 391737ns
I1120 12:08:25.296767 29833 replica.cpp:715] Persisted action at 2
I1120 12:08:25.297523 29825 replica.cpp:694] Replica received learned notice for position 2 from @0.0.0.0:0
I1120 12:08:25.297963 29825 leveldb.cpp:343] Persisting action (18 bytes) to leveldb took 387183ns
I1120 12:08:25.298037 29825 leveldb.cpp:401] Deleting ~1 keys from leveldb took 40831ns
I1120 12:08:25.298064 29825 replica.cpp:715] Persisted action at 2
I1120 12:08:25.298086 29825 replica.cpp:700] Replica learned TRUNCATE action at position 2
I1120 12:08:25.306686 29806 scheduler.cpp:156] Version: 0.26.0
I1120 12:08:25.307519 29831 scheduler.cpp:238] New master detected at master@172.17.5.188:41228
I1120 12:08:25.308984 29829 scheduler.cpp:300] Sending SUBSCRIBE call to master@172.17.5.188:41228
I1120 12:08:25.310982 29826 process.cpp:3081] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler'
I1120 12:08:25.311051 29826 http.cpp:338] HTTP POST for /master/api/v1/scheduler from 172.17.5.188:34360
I1120 12:08:25.311249 29826 master.cpp:1874] Received subscription request for HTTP framework 'default'
I1120 12:08:25.311323 29826 master.cpp:1651] Authorizing framework principal 'test-principal' to receive offers for role '*'
I1120 12:08:25.311621 29826 master.cpp:1966] Subscribing framework 'default' with checkpointing disabled and capabilities [ ]
I1120 12:08:25.312099 29833 hierarchical.cpp:197] Added framework 0fdff1f7-cb45-4d58-b44c-cba92980cf0f-0000
I1120 12:08:25.312166 29833 hierarchical.cpp:979] No resources available to allocate!
I1120 12:08:25.312209 29833 hierarchical.cpp:1072] No inverse offers to send out!
I1120 12:08:25.312227 29826 master.hpp:1522] Sending heartbeat to 0fdff1f7-cb45-4d58-b44c-cba92980cf0f-0000
I1120 12:08:25.312240 29833 hierarchical.cpp:878] Performed allocation for 0 slaves in 109225ns
I1120 12:08:25.313138 29839 scheduler.cpp:459] Enqueuing event SUBSCRIBED received from master@172.17.5.188:41228
I1120 12:08:25.313634 29839 scheduler.cpp:459] Enqueuing event HEARTBEAT received from master@172.17.5.188:41228
I1120 12:08:25.314296 29826 master_maintenance_tests.cpp:174] Ignoring HEARTBEAT event
I1120 12:08:25.314553 29834 scheduler.cpp:300] Sending REQUEST call to master@172.17.5.188:41228
I1120 12:08:25.316274 29830 process.cpp:3081] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler'
I1120 12:08:25.316352 29830 http.cpp:338] HTTP POST for /master/api/v1/scheduler from 172.17.5.188:34361
I1120 12:08:25.316472 29830 master.cpp:2621] Processing REQUEST call for framework 0fdff1f7-cb45-4d58-b44c-cba92980cf0f-0000 (default)
I1120 12:08:25.316656 29832 hierarchical.cpp:460] Received resource request from framework 0fdff1f7-cb45-4d58-b44c-cba92980cf0f-0000
I1120 12:08:25.317307 29840 master.cpp:928] Master terminating
I1120 12:08:25.317669 29838 hierarchical.cpp:232] Removed framework 0fdff1f7-cb45-4d58-b44c-cba92980cf0f-0000
E1120 12:08:25.318682 29829 scheduler.cpp:433] End-Of-File received from master. The master closed the event stream
[ OK ] ContentType/SchedulerTest.Request/0 (67 ms)
[ RUN ] ContentType/SchedulerTest.Request/1
I1120 12:08:25.328913 29806 leveldb.cpp:176] Opened db in 3.429308ms
I1120 12:08:25.332051 29806 leveldb.cpp:183] Compacted db in 2.925898ms
I1120 12:08:25.332130 29806 leveldb.cpp:198] Created db iterator in 26224ns
I1120 12:08:25.332149 29806 leveldb.cpp:204] Seeked to beginning of db in 1820ns
I1120 12:08:25.332161 29806 leveldb.cpp:273] Iterated through 0 keys in the db in 315ns
I1120 12:08:25.332221 29806 replica.cpp:780] Replica recovered with log positions 0 -> 0 with 1 holes and 0 unlearned
I1120 12:08:25.333537 29836 recover.cpp:449] Starting replica recovery
I1120 12:08:25.334307 29836 recover.cpp:475] Replica is in EMPTY status
I1120 12:08:25.336205 29835 replica.cpp:676] Replica in EMPTY status received a broadcasted recover request from (10663)@172.17.5.188:41228
I1120 12:08:25.336762 29828 recover.cpp:195] Received a recover response from a replica in EMPTY status
I1120 12:08:25.337694 29838 recover.cpp:566] Updating replica status to STARTING
I1120 12:08:25.338027 29839 master.cpp:367] Master 79b0a05a-1c28-483d-820f-5c53dcd3ccdf (a51e6bb03b55) started on 172.17.5.188:41228
I1120 12:08:25.338119 29839 master.cpp:369] Flags at startup: --acls="" --allocation_interval="1secs" --allocator="HierarchicalDRF" --authenticate="false" --authenticate_slaves="true" --authenticators="crammd5" --authorizers="local" --credentials="/tmp/BTrl23/credentials" --framework_sorter="drf" --help="false" --hostname_lookup="true" --initialize_driver_logging="true" --log_auto_initialize="true" --logbufsecs="0" --logging_level="INFO" --max_slave_ping_timeouts="5" --quiet="false" --recovery_slave_removal_limit="100%" --registry="replicated_log" --registry_fetch_timeout="1mins" --registry_store_timeout="25secs" --registry_strict="true" --root_submissions="true" --slave_ping_timeout="15secs" --slave_reregister_timeout="10mins" --user_sorter="drf" --version="false" --webui_dir="/mesos/mesos-0.26.0/_inst/share/mesos/webui" --work_dir="/tmp/BTrl23/master" --zk_session_timeout="10secs"
I1120 12:08:25.338629 29839 master.cpp:416] Master allowing unauthenticated frameworks to register
I1120 12:08:25.338719 29839 master.cpp:419] Master only allowing authenticated slaves to register
I1120 12:08:25.338816 29839 credentials.hpp:37] Loading credentials for authentication from '/tmp/BTrl23/credentials'
I1120 12:08:25.339290 29839 master.cpp:458] Using default 'crammd5' authenticator
I1120 12:08:25.339515 29839 master.cpp:495] Authorization enabled
I1120 12:08:25.339854 29837 whitelist_watcher.cpp:79] No whitelist given
I1120 12:08:25.339892 29840 hierarchical.cpp:153] Initialized hierarchical allocator process
I1120 12:08:25.341784 29831 leveldb.cpp:306] Persisting metadata (8 bytes) to leveldb took 748807ns
I1120 12:08:25.341847 29831 replica.cpp:323] Persisted replica status to STARTING
I1120 12:08:25.342425 29838 recover.cpp:475] Replica is in STARTING status
I1120 12:08:25.342568 29834 master.cpp:1612] The newly elected leader is master@172.17.5.188:41228 with id 79b0a05a-1c28-483d-820f-5c53dcd3ccdf
I1120 12:08:25.344306 29834 master.cpp:1625] Elected as the leading master!
I1120 12:08:25.344327 29834 master.cpp:1385] Recovering from registrar
I1120 12:08:25.344637 29838 registrar.cpp:309] Recovering registrar
I1120 12:08:25.345821 29838 replica.cpp:676] Replica in STARTING status received a broadcasted recover request from (10664)@172.17.5.188:41228
I1120 12:08:25.346334 29830 recover.cpp:195] Received a recover response from a replica in STARTING status
I1120 12:08:25.346889 29834 recover.cpp:566] Updating replica status to VOTING
I1120 12:08:25.347427 29829 leveldb.cpp:306] Persisting metadata (8 bytes) to leveldb took 383907ns
I1120 12:08:25.347460 29829 replica.cpp:323] Persisted replica status to VOTING
I1120 12:08:25.347579 29837 recover.cpp:580] Successfully joined the Paxos group
I1120 12:08:25.347829 29829 recover.cpp:464] Recover process terminated
I1120 12:08:25.348605 29827 log.cpp:661] Attempting to start the writer
I1120 12:08:25.350077 29835 replica.cpp:496] Replica received implicit promise request from (10665)@172.17.5.188:41228 with proposal 1
I1120 12:08:25.350466 29835 leveldb.cpp:306] Persisting metadata (8 bytes) to leveldb took 353959ns
I1120 12:08:25.350489 29835 replica.cpp:345] Persisted promised to 1
I1120 12:08:25.351200 29835 coordinator.cpp:240] Coordinator attempting to fill missing positions
I1120 12:08:25.352807 29831 replica.cpp:391] Replica received explicit promise request from (10666)@172.17.5.188:41228 for position 0 with proposal 2
I1120 12:08:25.353329 29831 leveldb.cpp:343] Persisting action (8 bytes) to leveldb took 432007ns
I1120 12:08:25.353363 29831 replica.cpp:715] Persisted action at 0
I1120 12:08:25.354647 29835 replica.cpp:540] Replica received write request for position 0 from (10667)@172.17.5.188:41228
I1120 12:08:25.354706 29835 leveldb.cpp:438] Reading position from leveldb took 27241ns
I1120 12:08:25.355157 29835 leveldb.cpp:343] Persisting action (14 bytes) to leveldb took 388427ns
I1120 12:08:25.355265 29835 replica.cpp:715] Persisted action at 0
I1120 12:08:25.356228 29835 replica.cpp:694] Replica received learned notice for position 0 from @0.0.0.0:0
I1120 12:08:25.356698 29835 leveldb.cpp:343] Persisting action (16 bytes) to leveldb took 374417ns
I1120 12:08:25.356725 29835 replica.cpp:715] Persisted action at 0
I1120 12:08:25.356745 29835 replica.cpp:700] Replica learned NOP action at position 0
I1120 12:08:25.357302 29839 log.cpp:677] Writer started with ending position 0
I1120 12:08:25.358822 29837 leveldb.cpp:438] Reading position from leveldb took 25652ns
I1120 12:08:25.360115 29834 registrar.cpp:342] Successfully fetched the registry (0B) in 15.432192ms
I1120 12:08:25.360252 29834 registrar.cpp:441] Applied 1 operations in 37951ns; attempting to update the 'registry'
I1120 12:08:25.361076 29834 log.cpp:685] Attempting to append 176 bytes to the log
I1120 12:08:25.361186 29826 coordinator.cpp:350] Coordinator attempting to write APPEND action at position 1
I1120 12:08:25.361865 29831 replica.cpp:540] Replica received write request for position 1 from (10668)@172.17.5.188:41228
I1120 12:08:25.362282 29831 leveldb.cpp:343] Persisting action (195 bytes) to leveldb took 376712ns
I1120 12:08:25.362313 29831 replica.cpp:715] Persisted action at 1
I1120 12:08:25.363118 29831 replica.cpp:694] Replica received learned notice for position 1 from @0.0.0.0:0
I1120 12:08:25.363443 29831 leveldb.cpp:343] Persisting action (197 bytes) to leveldb took 297004ns
I1120 12:08:25.363469 29831 replica.cpp:715] Persisted action at 1
I1120 12:08:25.363492 29831 replica.cpp:700] Replica learned APPEND action at position 1
I1120 12:08:25.364421 29839 registrar.cpp:486] Successfully updated the 'registry' in 4.103936ms
I1120 12:08:25.364687 29839 registrar.cpp:372] Successfully recovered registrar
I1120 12:08:25.365017 29831 log.cpp:704] Attempting to truncate the log to 1
I1120 12:08:25.365183 29839 master.cpp:1422] Recovered 0 slaves from the Registry (137B) ; allowing 10mins for slaves to re-register
I1120 12:08:25.365273 29839 coordinator.cpp:350] Coordinator attempting to write TRUNCATE action at position 2
I1120 12:08:25.366062 29837 replica.cpp:540] Replica received write request for position 2 from (10669)@172.17.5.188:41228
I1120 12:08:25.366412 29837 leveldb.cpp:343] Persisting action (16 bytes) to leveldb took 313345ns
I1120 12:08:25.366435 29837 replica.cpp:715] Persisted action at 2
I1120 12:08:25.367194 29837 replica.cpp:694] Replica received learned notice for position 2 from @0.0.0.0:0
I1120 12:08:25.367507 29837 leveldb.cpp:343] Persisting action (18 bytes) to leveldb took 285916ns
I1120 12:08:25.367563 29837 leveldb.cpp:401] Deleting ~1 keys from leveldb took 30553ns
I1120 12:08:25.367590 29837 replica.cpp:715] Persisted action at 2
I1120 12:08:25.367616 29837 replica.cpp:700] Replica learned TRUNCATE action at position 2
I1120 12:08:25.376078 29806 scheduler.cpp:156] Version: 0.26.0
I1120 12:08:25.376829 29837 scheduler.cpp:238] New master detected at master@172.17.5.188:41228
I1120 12:08:25.377861 29835 scheduler.cpp:300] Sending SUBSCRIBE call to master@172.17.5.188:41228
I1120 12:08:25.379771 29833 process.cpp:3081] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler'
I1120 12:08:25.379834 29833 http.cpp:338] HTTP POST for /master/api/v1/scheduler from 172.17.5.188:34362
I1120 12:08:25.380174 29833 master.cpp:1874] Received subscription request for HTTP framework 'default'
I1120 12:08:25.380235 29833 master.cpp:1651] Authorizing framework principal 'test-principal' to receive offers for role '*'
I1120 12:08:25.380489 29831 master.cpp:1966] Subscribing framework 'default' with checkpointing disabled and capabilities [ ]
I1120 12:08:25.380836 29832 hierarchical.cpp:197] Added framework 79b0a05a-1c28-483d-820f-5c53dcd3ccdf-0000
I1120 12:08:25.380887 29832 hierarchical.cpp:979] No resources available to allocate!
I1120 12:08:25.380925 29832 hierarchical.cpp:1072] No inverse offers to send out!
I1120 12:08:25.380939 29840 master.hpp:1522] Sending heartbeat to 79b0a05a-1c28-483d-820f-5c53dcd3ccdf-0000
I1120 12:08:25.380949 29832 hierarchical.cpp:878] Performed allocation for 0 slaves in 89631ns
I1120 12:08:25.381714 29836 scheduler.cpp:459] Enqueuing event SUBSCRIBED received from master@172.17.5.188:41228
I1120 12:08:25.382556 29832 scheduler.cpp:300] Sending REQUEST call to master@172.17.5.188:41228
I1120 12:08:25.383285 29832 scheduler.cpp:459] Enqueuing event HEARTBEAT received from master@172.17.5.188:41228
I1120 12:08:25.383855 29832 master_maintenance_tests.cpp:174] Ignoring HEARTBEAT event
I1120 12:08:25.384623 29840 process.cpp:3081] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler'
I1120 12:08:25.384680 29840 http.cpp:338] HTTP POST for /master/api/v1/scheduler from 172.17.5.188:34363
I1120 12:08:25.385099 29840 master.cpp:2621] Processing REQUEST call for framework 79b0a05a-1c28-483d-820f-5c53dcd3ccdf-0000 (default)
I1120 12:08:25.385273 29831 hierarchical.cpp:460] Received resource request from framework 79b0a05a-1c28-483d-820f-5c53dcd3ccdf-0000
I1120 12:08:25.385632 29806 master.cpp:928] Master terminating
I1120 12:08:25.385840 29840 hierarchical.cpp:232] Removed framework 79b0a05a-1c28-483d-820f-5c53dcd3ccdf-0000
[ OK ] ContentType/SchedulerTest.Request/1 (67 ms)
[----------] 22 tests from ContentType/SchedulerTest (4587 ms total)
[----------] Global test environment tear-down
[==========] 830 tests from 112 test cases ran. (340284 ms total)
[ PASSED ] 829 tests.
[ FAILED ] 1 test, listed below:
[ FAILED ] DiskQuotaTest.SlaveRecovery
1 FAILED TEST
YOU HAVE 7 DISABLED TESTS
make[4]: *** [check-local] Error 1
make[4]: Leaving directory `/mesos/mesos-0.26.0/_build/src'
make[3]: *** [check-am] Error 2
make[3]: Leaving directory `/mesos/mesos-0.26.0/_build/src'
make[2]: *** [check] Error 2
make[2]: Leaving directory `/mesos/mesos-0.26.0/_build/src'
make[1]: *** [check-recursive] Error 1
make[1]: Leaving directory `/mesos/mesos-0.26.0/_build'
make: *** [distcheck] Error 1
+ docker rmi mesos-1448019406-25009
Untagged: mesos-1448019406-25009:latest
Deleted: 49fbc98559614dbd7773780553ebeaa5726fe17522f273f8acbd180e8cfb154a
Deleted: 12a6ab573ef52fc81059b891caa34703f7b8d833e169e0ade1d2fbf71af89098
Deleted: 289952416bdd05b7e4fc549ed36e41c38f6bc862a377d4302d350b388d79d622
Deleted: 7e1ade7663d7424018e49287233c5af53e702b3ca721386692fcd1a393b2bc9d
Deleted: 72523e374c2b1fe604336b33fb9598a543a7be5e9aaddd809265a0586de88c28
Deleted: aed7b247dc5d574eedb06824d02225a943c0e5d23fb31fb3c0adbd006928a754
Deleted: f916be865d93adbe3ad7fab1852e5715169af0f6760c93c56384a112ef8e2d6f
Deleted: 3cd09751bdd63c45a2a0f90e45f0fceaf148495d1dc1075934ea59ccfaf864df
Deleted: 25e86035bf97496561f0a6d413172f4670eb54aea5cbe8208e6bd4eaa2664046
Deleted: 00d8fdd13902ecbeb958f2610017d7a8d4664d46ffdc0967083c5c0137ba4db8
Deleted: 100b8c36dd6d7d65483ba01dba805f3bb7e81742e897b590de0ec7c17af222f9
Deleted: 73eec9c63b74973b3d73a3ece0d0d70f3b842856446a96dc40692fa273ea7e35
Deleted: ed1734ddeb5bbd2db11d8bf16a73fd8a321f31748fdcc8ac01d9a57f40a87734
Build step 'Execute shell' marked build as failure
Jenkins build is back to normal : Mesos » gcc,--verbose,ubuntu:14.04,docker||Hadoop #1250
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Mesos/COMPILER=gcc,CONFIGURATION=--verbose,OS=ubuntu%3A14.04,label_exp=docker%7C%7CHadoop/1250/changes>