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 2016/12/09 20:02:42 UTC

Build failed in Jenkins: mesos-reviewbot #16393

See <https://builds.apache.org/job/mesos-reviewbot/16393/>

------------------------------------------
[...truncated 134600 lines...]
I1209 20:01:45.609979 29730 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-readonly'
I1209 20:01:45.610153 29730 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-readwrite'
I1209 20:01:45.610270 29730 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-scheduler'
I1209 20:01:45.610388 29730 master.cpp:584] Authorization enabled
I1209 20:01:45.612095 29734 hierarchical.cpp:149] Initialized hierarchical allocator process
I1209 20:01:45.612237 29734 whitelist_watcher.cpp:77] No whitelist given
I1209 20:01:45.618299 29727 master.cpp:2045] Elected as the leading master!
I1209 20:01:45.618377 29727 master.cpp:1568] Recovering from registrar
I1209 20:01:45.618592 29730 registrar.cpp:329] Recovering registrar
I1209 20:01:45.620012 29727 registrar.cpp:362] Successfully fetched the registry (0B) in 1.360128ms
I1209 20:01:45.620527 29727 registrar.cpp:461] Applied 1 operations in 27807ns; attempting to update the registry
I1209 20:01:45.628526 29727 registrar.cpp:506] Successfully updated the registry in 7.641856ms
I1209 20:01:45.628737 29727 registrar.cpp:392] Successfully recovered registrar
I1209 20:01:45.629319 29727 master.cpp:1684] Recovered 0 agents from the registry (129B); allowing 10mins for agents to re-register
I1209 20:01:45.629572 29727 hierarchical.cpp:176] Skipping recovery of hierarchical allocator: nothing to recover
I1209 20:01:45.636404 29701 cluster.cpp:446] Creating default 'local' authorizer
I1209 20:01:45.638912 29722 slave.cpp:209] Mesos agent started on (492)@172.17.0.2:49246
I1209 20:01:45.639294 29701 scheduler.cpp:182] Version: 1.2.0
I1209 20:01:45.638938 29722 slave.cpp:210] Flags at startup: --acls="" --appc_simple_discovery_uri_prefix="http://" --appc_store_dir="/tmp/mesos/store/appc" --authenticate_http_readonly="true" --authenticate_http_readwrite="true" --authenticatee="crammd5" --authentication_backoff_factor="1secs" --authorizer="local" --cgroups_cpu_enable_pids_and_tids_count="false" --cgroups_enable_cfs="false" --cgroups_hierarchy="/sys/fs/cgroup" --cgroups_limit_swap="false" --cgroups_root="mesos" --container_disk_watch_interval="15secs" --containerizers="mesos" --credential="/tmp/SlaveTest_RunTaskGroup_TfM6nR/credential" --default_role="*" --disk_watch_interval="1mins" --docker="docker" --docker_kill_orphans="true" --docker_registry="https://registry-1.docker.io" --docker_remove_delay="6hrs" --docker_socket="/var/run/docker.sock" --docker_stop_timeout="0ns" --docker_store_dir="/tmp/mesos/store/docker" --docker_volume_checkpoint_dir="/var/run/mesos/isolators/docker/volume" --enforce_container_disk_quota="false" --executor_registration_timeout="1mins" --executor_shutdown_grace_period="5secs" --fetcher_cache_dir="/tmp/SlaveTest_RunTaskGroup_TfM6nR/fetch" --fetcher_cache_size="2GB" --frameworks_home="" --gc_delay="1weeks" --gc_disk_headroom="0.1" --hadoop_home="" --help="false" --hostname_lookup="true" --http_authenticators="basic" --http_command_executor="false" --http_credentials="/tmp/SlaveTest_RunTaskGroup_TfM6nR/http_credentials" --image_provisioner_backend="copy" --initialize_driver_logging="true" --io_switchboard_enable_server="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.2.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/SlaveTest_RunTaskGroup_TfM6nR" --sandbox_directory="/mnt/mesos/sandbox" --strict="true" --switch_user="true" --systemd_enable_support="true" --systemd_runtime_directory="/run/systemd/system" --version="false" --work_dir="/tmp/SlaveTest_RunTaskGroup_0MGFtk"
I1209 20:01:45.640123 29722 credentials.hpp:86] Loading credential for authentication from '/tmp/SlaveTest_RunTaskGroup_TfM6nR/credential'
I1209 20:01:45.640324 29724 scheduler.cpp:475] New master detected at master@172.17.0.2:49246
I1209 20:01:45.640363 29724 scheduler.cpp:484] Waiting for 0ns before initiating a re-(connection) attempt with the master
I1209 20:01:45.644210 29735 scheduler.cpp:359] Connected with the master at http://172.17.0.2:49246/master/api/v1/scheduler
I1209 20:01:45.645726 29729 scheduler.cpp:241] Sending SUBSCRIBE call to http://172.17.0.2:49246/master/api/v1/scheduler
I1209 20:01:45.647265 29735 process.cpp:3679] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler'
I1209 20:01:45.649412 29725 http.cpp:393] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:38734
I1209 20:01:45.649758 29725 master.cpp:2344] Received subscription request for HTTP framework 'default'
I1209 20:01:45.649858 29725 master.cpp:2081] Authorizing framework principal 'test-principal' to receive offers for role '*'
I1209 20:01:45.650354 29733 master.cpp:2458] Subscribing framework 'default' with checkpointing disabled and capabilities [  ]
I1209 20:01:45.651104 29735 hierarchical.cpp:276] Added framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.651271 29735 hierarchical.cpp:1689] No allocations performed
I1209 20:01:45.651314 29735 hierarchical.cpp:1784] No inverse offers to send out!
I1209 20:01:45.651592 29735 hierarchical.cpp:1291] Performed allocation for 0 agents in 453373ns
I1209 20:01:45.651783 29731 master.hpp:2178] Sending heartbeat to 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.652901 29733 scheduler.cpp:681] Enqueuing event SUBSCRIBED received from http://172.17.0.2:49246/master/api/v1/scheduler
I1209 20:01:45.653445 29733 scheduler.cpp:681] Enqueuing event HEARTBEAT received from http://172.17.0.2:49246/master/api/v1/scheduler
I1209 20:01:45.661815 29722 slave.cpp:347] Agent using credential for: test-principal
I1209 20:01:45.661866 29722 credentials.hpp:37] Loading credentials for authentication from '/tmp/SlaveTest_RunTaskGroup_TfM6nR/http_credentials'
I1209 20:01:45.662189 29722 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1209 20:01:45.662431 29722 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1209 20:01:45.663717 29722 slave.cpp:534] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1209 20:01:45.663962 29722 slave.cpp:542] Agent attributes: [  ]
I1209 20:01:45.664007 29722 slave.cpp:547] Agent hostname: ce07bfe7cc12
I1209 20:01:45.665962 29735 state.cpp:57] Recovering state from '/tmp/SlaveTest_RunTaskGroup_0MGFtk/meta'
I1209 20:01:45.666489 29721 status_update_manager.cpp:203] Recovering status update manager
I1209 20:01:45.666939 29721 slave.cpp:5415] Finished recovery
I1209 20:01:45.667465 29721 slave.cpp:5589] Querying resource estimator for oversubscribable resources
I1209 20:01:45.668015 29728 status_update_manager.cpp:177] Pausing sending status updates
I1209 20:01:45.668123 29733 slave.cpp:919] New master detected at master@172.17.0.2:49246
I1209 20:01:45.668159 29733 slave.cpp:978] Authenticating with master master@172.17.0.2:49246
I1209 20:01:45.668412 29733 slave.cpp:989] Using default CRAM-MD5 authenticatee
I1209 20:01:45.668684 29733 slave.cpp:951] Detecting new master
I1209 20:01:45.668763 29724 authenticatee.cpp:121] Creating new client SASL connection
I1209 20:01:45.668869 29733 slave.cpp:5603] Received oversubscribable resources {} from the resource estimator
I1209 20:01:45.669272 29733 master.cpp:6748] Authenticating slave(492)@172.17.0.2:49246
I1209 20:01:45.669459 29724 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(1008)@172.17.0.2:49246
I1209 20:01:45.669770 29733 authenticator.cpp:98] Creating new server SASL connection
I1209 20:01:45.670099 29720 authenticatee.cpp:213] Received SASL authentication mechanisms: CRAM-MD5
I1209 20:01:45.670138 29720 authenticatee.cpp:239] Attempting to authenticate with mechanism 'CRAM-MD5'
I1209 20:01:45.670261 29720 authenticator.cpp:204] Received SASL authentication start
I1209 20:01:45.670336 29720 authenticator.cpp:326] Authentication requires more steps
I1209 20:01:45.670426 29720 authenticatee.cpp:259] Received SASL authentication step
I1209 20:01:45.670534 29720 authenticator.cpp:232] Received SASL authentication step
I1209 20:01:45.670568 29720 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'ce07bfe7cc12' server FQDN: 'ce07bfe7cc12' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false 
I1209 20:01:45.670589 29720 auxprop.cpp:181] Looking up auxiliary property '*userPassword'
I1209 20:01:45.670640 29720 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5'
I1209 20:01:45.670672 29720 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'ce07bfe7cc12' server FQDN: 'ce07bfe7cc12' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true 
I1209 20:01:45.670687 29720 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since SASL_AUXPROP_AUTHZID == true
I1209 20:01:45.670699 29720 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5' since SASL_AUXPROP_AUTHZID == true
I1209 20:01:45.670724 29720 authenticator.cpp:318] Authentication success
I1209 20:01:45.670913 29720 authenticatee.cpp:299] Authentication success
I1209 20:01:45.671011 29720 master.cpp:6778] Successfully authenticated principal 'test-principal' at slave(492)@172.17.0.2:49246
I1209 20:01:45.671113 29720 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(1008)@172.17.0.2:49246
I1209 20:01:45.671512 29720 slave.cpp:1073] Successfully authenticated with master master@172.17.0.2:49246
I1209 20:01:45.671720 29720 slave.cpp:1487] Will retry registration in 7.701788ms if necessary
I1209 20:01:45.672060 29724 master.cpp:5161] Registering agent at slave(492)@172.17.0.2:49246 (ce07bfe7cc12) with id 00c5f81c-567f-4534-8658-4c3ec8708696-S0
I1209 20:01:45.672710 29724 registrar.cpp:461] Applied 1 operations in 79687ns; attempting to update the registry
I1209 20:01:45.674986 29724 registrar.cpp:506] Successfully updated the registry in 2.18112ms
I1209 20:01:45.676152 29723 slave.cpp:4267] Received ping from slave-observer(473)@172.17.0.2:49246
I1209 20:01:45.676231 29724 master.cpp:5232] Registered agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12) with cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1209 20:01:45.676317 29723 slave.cpp:1119] Registered with master master@172.17.0.2:49246; given agent ID 00c5f81c-567f-4534-8658-4c3ec8708696-S0
I1209 20:01:45.676425 29723 fetcher.cpp:90] Clearing fetcher cache
I1209 20:01:45.676838 29724 hierarchical.cpp:490] Added agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 (ce07bfe7cc12) with cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] (allocated: {})
I1209 20:01:45.676863 29723 slave.cpp:1142] Checkpointing SlaveInfo to '/tmp/SlaveTest_RunTaskGroup_0MGFtk/meta/slaves/00c5f81c-567f-4534-8658-4c3ec8708696-S0/slave.info'
I1209 20:01:45.677302 29723 slave.cpp:1179] Forwarding total oversubscribed resources {}
I1209 20:01:45.677454 29723 status_update_manager.cpp:184] Resuming sending status updates
I1209 20:01:45.677693 29723 master.cpp:5633] Received update of agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12) with total oversubscribed resources {}
I1209 20:01:45.678304 29724 hierarchical.cpp:1784] No inverse offers to send out!
I1209 20:01:45.678391 29724 hierarchical.cpp:1314] Performed allocation for agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 in 1.50208ms
I1209 20:01:45.678563 29724 hierarchical.cpp:560] Agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 (ce07bfe7cc12) updated with oversubscribed resources {} (total: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000], allocated: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000])
I1209 20:01:45.678711 29724 hierarchical.cpp:1689] No allocations performed
I1209 20:01:45.678752 29724 hierarchical.cpp:1784] No inverse offers to send out!
I1209 20:01:45.678808 29724 hierarchical.cpp:1314] Performed allocation for agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 in 191230ns
I1209 20:01:45.678952 29723 master.cpp:6577] Sending 1 offers to framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (default)
I1209 20:01:45.681363 29723 scheduler.cpp:681] Enqueuing event OFFERS received from http://172.17.0.2:49246/master/api/v1/scheduler
I1209 20:01:45.683918 29723 scheduler.cpp:241] Sending ACCEPT call to http://172.17.0.2:49246/master/api/v1/scheduler
I1209 20:01:45.685487 29731 process.cpp:3679] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler'
I1209 20:01:45.687208 29731 http.cpp:393] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:38733
I1209 20:01:45.688411 29731 master.cpp:3588] Processing ACCEPT call for offers: [ 00c5f81c-567f-4534-8658-4c3ec8708696-O0 ] on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12) for framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (default)
I1209 20:01:45.688601 29731 master.cpp:3175] Authorizing framework principal 'test-principal' to launch task 89467453-a761-47ba-adb8-e0a0cce80752
I1209 20:01:45.689007 29731 master.cpp:3175] Authorizing framework principal 'test-principal' to launch task 84dd81af-f2b3-4051-bf96-4590f2471c83
I1209 20:01:45.694131 29720 master.cpp:8501] Adding task 89467453-a761-47ba-adb8-e0a0cce80752 with resources cpus(*):0.1; mem(*):32; disk(*):32 on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 (ce07bfe7cc12)
I1209 20:01:45.694634 29720 master.cpp:8501] Adding task 84dd81af-f2b3-4051-bf96-4590f2471c83 with resources cpus(*):0.1; mem(*):32; disk(*):32 on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 (ce07bfe7cc12)
I1209 20:01:45.694875 29720 master.cpp:4445] Launching task group { 84dd81af-f2b3-4051-bf96-4590f2471c83, 89467453-a761-47ba-adb8-e0a0cce80752 } of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (default) with resources cpus(*):0.2; mem(*):64; disk(*):64 on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12)
I1209 20:01:45.695554 29723 slave.cpp:1551] Got assigned task group containing tasks [ 89467453-a761-47ba-adb8-e0a0cce80752, 84dd81af-f2b3-4051-bf96-4590f2471c83 ] for framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.696321 29726 hierarchical.cpp:1023] Recovered cpus(*):1.7; mem(*):928; disk(*):928; ports(*):[31000-32000] (total: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000], allocated: cpus(*):0.3; mem(*):96; disk(*):96) on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 from framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.696528 29726 hierarchical.cpp:1060] Framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 filtered agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 for 5secs
I1209 20:01:45.697247 29723 slave.cpp:1713] Launching task group containing tasks [ 89467453-a761-47ba-adb8-e0a0cce80752, 84dd81af-f2b3-4051-bf96-4590f2471c83 ] for framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.718863 29723 paths.cpp:530] Trying to chown '/tmp/SlaveTest_RunTaskGroup_0MGFtk/slaves/00c5f81c-567f-4534-8658-4c3ec8708696-S0/frameworks/00c5f81c-567f-4534-8658-4c3ec8708696-0000/executors/default/runs/7a954141-8f1e-4070-9c4c-d7e01722de1a' to user 'mesos'
I1209 20:01:45.727318 29723 slave.cpp:6342] Launching executor 'default' of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 with resources cpus(*):0.1; mem(*):32; disk(*):32 in work directory '/tmp/SlaveTest_RunTaskGroup_0MGFtk/slaves/00c5f81c-567f-4534-8658-4c3ec8708696-S0/frameworks/00c5f81c-567f-4534-8658-4c3ec8708696-0000/executors/default/runs/7a954141-8f1e-4070-9c4c-d7e01722de1a'
I1209 20:01:45.728471 29723 slave.cpp:2035] Queued task group containing tasks [ 89467453-a761-47ba-adb8-e0a0cce80752, 84dd81af-f2b3-4051-bf96-4590f2471c83 ] for executor 'default' of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.728593 29723 slave.cpp:872] Successfully attached file '/tmp/SlaveTest_RunTaskGroup_0MGFtk/slaves/00c5f81c-567f-4534-8658-4c3ec8708696-S0/frameworks/00c5f81c-567f-4534-8658-4c3ec8708696-0000/executors/default/runs/7a954141-8f1e-4070-9c4c-d7e01722de1a'
I1209 20:01:45.730275 29730 executor.cpp:189] Version: 1.2.0
I1209 20:01:45.732908 29728 executor.cpp:390] Connected with the agent
I1209 20:01:45.733757 29720 executor.cpp:291] Sending SUBSCRIBE call to http://172.17.0.2:49246/slave(492)/api/v1/executor
I1209 20:01:45.734917 29727 process.cpp:3679] Handling HTTP event for process 'slave(492)' with path: '/slave(492)/api/v1/executor'
I1209 20:01:45.736141 29733 http.cpp:290] HTTP POST for /slave(492)/api/v1/executor from 172.17.0.2:38735
I1209 20:01:45.736348 29733 slave.cpp:3090] Received Subscribe request for HTTP executor 'default' of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.737967 29733 slave.cpp:2280] Sending queued task group task group containing tasks [ 89467453-a761-47ba-adb8-e0a0cce80752, 84dd81af-f2b3-4051-bf96-4590f2471c83 ] to executor 'default' of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (via HTTP)
I1209 20:01:45.740180 29735 executor.cpp:705] Enqueuing event SUBSCRIBED received from http://172.17.0.2:49246/slave(492)/api/v1/executor
I1209 20:01:45.741811 29726 executor.cpp:705] Enqueuing event LAUNCH_GROUP received from http://172.17.0.2:49246/slave(492)/api/v1/executor
I1209 20:01:45.744420 29727 master.cpp:1305] Framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (default) disconnected
I1209 20:01:45.744446 29727 master.cpp:2918] Disconnecting framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (default)
I1209 20:01:45.744498 29727 master.cpp:2942] Deactivating framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (default)
I1209 20:01:45.744607 29727 master.cpp:1318] Giving framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (default) 0ns to failover
I1209 20:01:45.744896 29727 hierarchical.cpp:391] Deactivated framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.752106 29724 master.cpp:6429] Framework failover timeout, removing framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (default)
I1209 20:01:45.752140 29724 master.cpp:7299] Removing framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (default)
I1209 20:01:45.752362 29724 master.cpp:7867] Updating the state of task 84dd81af-f2b3-4051-bf96-4590f2471c83 of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (latest state: TASK_KILLED, status update state: TASK_KILLED)
I1209 20:01:45.752965 29724 master.cpp:7963] Removing task 84dd81af-f2b3-4051-bf96-4590f2471c83 with resources cpus(*):0.1; mem(*):32; disk(*):32 of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12)
I1209 20:01:45.753232 29724 master.cpp:7867] Updating the state of task 89467453-a761-47ba-adb8-e0a0cce80752 of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (latest state: TASK_KILLED, status update state: TASK_KILLED)
I1209 20:01:45.753577 29724 master.cpp:7963] Removing task 89467453-a761-47ba-adb8-e0a0cce80752 with resources cpus(*):0.1; mem(*):32; disk(*):32 of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12)
I1209 20:01:45.753964 29724 master.cpp:7992] Removing executor 'default' with resources cpus(*):0.1; mem(*):32; disk(*):32 of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12)
I1209 20:01:45.754722 29724 slave.cpp:2579] Asked to shut down framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 by master@172.17.0.2:49246
I1209 20:01:45.754770 29724 slave.cpp:2604] Shutting down framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.756446 29733 hierarchical.cpp:1023] Recovered cpus(*):0.1; mem(*):32; disk(*):32 (total: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000], allocated: cpus(*):0.2; mem(*):64; disk(*):64) on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 from framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.757078 29733 hierarchical.cpp:1023] Recovered cpus(*):0.1; mem(*):32; disk(*):32 (total: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000], allocated: cpus(*):0.1; mem(*):32; disk(*):32) on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 from framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.757764 29733 hierarchical.cpp:1023] Recovered cpus(*):0.1; mem(*):32; disk(*):32 (total: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000], allocated: {}) on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 from framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.758044 29733 hierarchical.cpp:342] Removed framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.758296 29724 slave.cpp:4994] Shutting down executor 'default' of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (via HTTP)
I1209 20:01:45.760174 29726 executor.cpp:705] Enqueuing event SHUTDOWN received from http://172.17.0.2:49246/slave(492)/api/v1/executor
I1209 20:01:45.761499 29730 slave.cpp:4676] Executor 'default' of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 exited with status 0
I*** Aborted at 1481313705 (unix time) try "date -d @1481313705" if you are using GNU date ***
1209 20:01:45.761953 29730 slave.cpp:4780] Cleaning up executor 'default' of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 (via HTTP)
W1209 20:01:45.762114 29734 master.cpp:5887] Ignoring unknown exited executor 'default' of framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000 on agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12)
I1209 20:01:45.762372 29728 gc.cpp:55] Scheduling '/tmp/SlaveTest_RunTaskGroup_0MGFtk/slaves/00c5f81c-567f-4534-8658-4c3ec8708696-S0/frameworks/00c5f81c-567f-4534-8658-4c3ec8708696-0000/executors/default/runs/7a954141-8f1e-4070-9c4c-d7e01722de1a' for gc 6.99999117817185days in the future
I1209 20:01:45.762934 29728 gc.cpp:55] Scheduling '/tmp/SlaveTest_RunTaskGroup_0MGFtk/slaves/00c5f81c-567f-4534-8658-4c3ec8708696-S0/frameworks/00c5f81c-567f-4534-8658-4c3ec8708696-0000/executors/default' for gc 6.99999117601778days in the future
I1209 20:01:45.762946 29730 slave.cpp:4868] Cleaning up framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.763171 29732 status_update_manager.cpp:285] Closing status update streams for framework 00c5f81c-567f-4534-8658-4c3ec8708696-0000
I1209 20:01:45.763185 29734 gc.cpp:55] Scheduling '/tmp/SlaveTest_RunTaskGroup_0MGFtk/slaves/00c5f81c-567f-4534-8658-4c3ec8708696-S0/frameworks/00c5f81c-567f-4534-8658-4c3ec8708696-0000' for gc 6.99999116761481days in the future
I1209 20:01:45.763294 29730 slave.cpp:791] Agent terminating
I1209 20:01:45.763535 29728 master.cpp:1258] Agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12) disconnected
I1209 20:01:45.763557 29728 master.cpp:2977] Disconnecting agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12)
I1209 20:01:45.763669 29728 master.cpp:2996] Deactivating agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 at slave(492)@172.17.0.2:49246 (ce07bfe7cc12)
I1209 20:01:45.763952 29724 hierarchical.cpp:589] Agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0 deactivated
I1209 20:01:45.767096 29729 master.cpp:1097] Master terminating
I1209 20:01:45.768168 29731 hierarchical.cpp:522] Removed agent 00c5f81c-567f-4534-8658-4c3ec8708696-S0
[       OK ] SlaveTest.RunTaskGroup (171 ms)
[ RUN      ] SlaveTest.KillTaskGroupBetweenRunTaskParts
PC: @          0x1c666c0 testing::internal::UntypedFunctionMockerBase::UntypedInvokeWith()
*** SIGSEGV (@0x30) received by PID 29701 (TID 0x2b1143230700) from PID 48; stack trace: ***
    @     0x2b1147806197 (unknown)
    @     0x2b114780a479 (unknown)
    @     0x2b113abc1330 (unknown)
    @          0x1c666c0 testing::internal::UntypedFunctionMockerBase::UntypedInvokeWith()
    @           0xe2b799 _ZN7testing8internal18FunctionMockerBaseIFvPN5mesos2v18executor5MesosEEE10InvokeWithERKSt5tupleIJS6_EE
    @           0xe24640 testing::internal::FunctionMocker<>::Invoke()
I1209 20:01:45.813288 29701 cluster.cpp:160] Creating default 'local' authorizer
    @           0xe2baff mesos::internal::tests::executor::MockHTTPExecutor<>::shutdown()
I1209 20:01:45.816730 29728 master.cpp:380] Master 191a8e8a-c7f9-4d36-a929-849692c6ac9c (ce07bfe7cc12) started on 172.17.0.2:49246
I1209 20:01:45.816764 29728 master.cpp:382] Flags at startup: --acls="" --agent_ping_timeout="15secs" --agent_reregister_timeout="10mins" --allocation_interval="1secs" --allocator="HierarchicalDRF" --authenticate_agents="true" --authenticate_frameworks="true" --authenticate_http_frameworks="true" --authenticate_http_readonly="true" --authenticate_http_readwrite="true" --authenticators="crammd5" --authorizers="local" --credentials="/tmp/OdxEGs/credentials" --framework_sorter="drf" --help="false" --hostname_lookup="true" --http_authenticators="basic" --http_framework_authenticators="basic" --initialize_driver_logging="true" --log_auto_initialize="true" --logbufsecs="0" --logging_level="INFO" --max_agent_ping_timeouts="5" --max_completed_frameworks="50" --max_completed_tasks_per_framework="1000" --quiet="false" --recovery_agent_removal_limit="100%" --registry="in_memory" --registry_fetch_timeout="1mins" --registry_gc_interval="15mins" --registry_max_agent_age="2weeks" --registry_max_agent_count="102400" --registry_store_timeout="100secs" --registry_strict="false" --root_submissions="true" --user_sorter="drf" --version="false" --webui_dir="/mesos/mesos-1.2.0/_inst/share/mesos/webui" --work_dir="/tmp/OdxEGs/master" --zk_session_timeout="10secs"
I1209 20:01:45.817404 29728 master.cpp:432] Master only allowing authenticated frameworks to register
I1209 20:01:45.817423 29728 master.cpp:446] Master only allowing authenticated agents to register
I1209 20:01:45.817435 29728 master.cpp:459] Master only allowing authenticated HTTP frameworks to register
I1209 20:01:45.817445 29728 credentials.hpp:37] Loading credentials for authentication from '/tmp/OdxEGs/credentials'
I1209 20:01:45.817996 29728 master.cpp:504] Using default 'crammd5' authenticator
I1209 20:01:45.818256 29728 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-readonly'
I1209 20:01:45.818512 29728 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-readwrite'
I1209 20:01:45.818713 29728 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-scheduler'
I1209 20:01:45.818915 29728 master.cpp:584] Authorization enabled
I1209 20:01:45.820052 29725 whitelist_watcher.cpp:77] No whitelist given
I1209 20:01:45.822721 29734 hierarchical.cpp:149] Initialized hierarchical allocator process
I1209 20:01:45.824980 29728 master.cpp:2045] Elected as the leading master!
I1209 20:01:45.825048 29728 master.cpp:1568] Recovering from registrar
I1209 20:01:45.825253 29726 registrar.cpp:329] Recovering registrar
    @           0xe249b4 mesos::internal::tests::executor::MockHTTPExecutor<>::event()
I1209 20:01:45.826876 29726 registrar.cpp:362] Successfully fetched the registry (0B) in 1568us
I1209 20:01:45.827038 29726 registrar.cpp:461] Applied 1 operations in 24738ns; attempting to update the registry
I1209 20:01:45.828600 29726 registrar.cpp:506] Successfully updated the registry in 1.351168ms
I1209 20:01:45.828950 29726 registrar.cpp:392] Successfully recovered registrar
I1209 20:01:45.830345 29728 master.cpp:1684] Recovered 0 agents from the registry (129B); allowing 10mins for agents to re-register
I1209 20:01:45.830490 29731 hierarchical.cpp:176] Skipping recovery of hierarchical allocator: nothing to recover
    @           0xe1d158 mesos::internal::tests::executor::TestMesos<>::events()
    @           0xe41dff std::_Mem_fn<>::operator()<>()
    @           0xe35bd9 _ZNSt5_BindIFSt7_Mem_fnIMN5mesos8internal5tests8executor9TestMesosINS1_2v18executor5MesosENS7_5EventEEEFvSt5queueIS9_St5dequeIS9_SaIS9_EEEEEPSA_St12_PlaceholderILi1EEEE6__callIvIRKSF_EILm0ELm1EEEET_OSt5tupleIIDpT0_EESt12_Index_tupleIIXspT1_EEE
    @           0xe2bee1 _ZNSt5_BindIFSt7_Mem_fnIMN5mesos8internal5tests8executor9TestMesosINS1_2v18executor5MesosENS7_5EventEEEFvSt5queueIS9_St5dequeIS9_SaIS9_EEEEEPSA_St12_PlaceholderILi1EEEEclIJRKSF_EvEET0_DpOT_
    @           0xe24d74 std::_Function_handler<>::_M_invoke()
    @     0x2b1137645507 std::function<>::operator()()
    @     0x2b113763dac8 process::AsyncExecutorProcess::execute<>()
    @     0x2b1137645628 _ZZN7process8dispatchI7NothingNS_20AsyncExecutorProcessERKSt8functionIFvRKSt5queueIN5mesos2v18executor5EventESt5dequeIS8_SaIS8_EEEEESC_PvSG_SC_SJ_EENS_6FutureIT_EERKNS_3PIDIT0_EEMSO_FSL_T1_T2_T3_ET4_T5_T6_ENKUlPNS_11ProcessBaseEE_clES11_
    @     0x2b1137652256 _ZNSt17_Function_handlerIFvPN7process11ProcessBaseEEZNS0_8dispatchI7NothingNS0_20AsyncExecutorProcessERKSt8functionIFvRKSt5queueIN5mesos2v18executor5EventESt5dequeISC_SaISC_EEEEESG_PvSK_SG_SN_EENS0_6FutureIT_EERKNS0_3PIDIT0_EEMSS_FSP_T1_T2_T3_ET4_T5_T6_EUlS2_E_E9_M_invokeERKSt9_Any_dataS2_
    @     0x2b11389bc0f1 std::function<>::operator()()
    @     0x2b113899de39 process::ProcessBase::visit()
    @     0x2b11389a8686 process::DispatchEvent::visit()
    @           0xab82ac process::ProcessBase::serve()
    @     0x2b113899a126 process::ProcessManager::resume()
    @     0x2b113899696a _ZZN7process14ProcessManager12init_threadsEvENKUt_clEv
    @     0x2b11389a7dc0 _ZNSt12_Bind_simpleIFZN7process14ProcessManager12init_threadsEvEUt_vEE9_M_invokeIIEEEvSt12_Index_tupleIIXspT_EEE
    @     0x2b11389a7d17 _ZNSt12_Bind_simpleIFZN7process14ProcessManager12init_threadsEvEUt_vEEclEv
    @     0x2b11389a7cb0 _ZNSt6thread5_ImplISt12_Bind_simpleIFZN7process14ProcessManager12init_threadsEvEUt_vEEE6_M_runEv
    @     0x2b113a442a60 (unknown)
    @     0x2b113abb9184 start_thread
    @     0x2b113aec937d (unknown)
make[4]: *** [check-local] Segmentation fault
make[4]: Leaving directory `/mesos/mesos-1.2.0/_build/src'
make[3]: *** [check-am] Error 2
make[3]: Leaving directory `/mesos/mesos-1.2.0/_build/src'
make[2]: *** [check] Error 2
make[2]: Leaving directory `/mesos/mesos-1.2.0/_build/src'
make[1]: *** [check-recursive] Error 1
make[1]: Leaving directory `/mesos/mesos-1.2.0/_build'
make: *** [distcheck] Error 1
+ docker rmi mesos-1481310730-1044
Untagged: mesos-1481310730-1044:latest
Deleted: sha256:b4c2b9c8d6bb84cfc89a99fadc6b6c3cfc8e3c0ba3c447d91999ce44bb1ebce4
Deleted: sha256:109b3e8b68b338d3a4bf06d77f3cfe33f807b91bc3c59591a13745e72f13b0fb
Deleted: sha256:613aceb1a8eda642c458ac83543a49df6f17e5704d8b1704d00407a342e0880f
Deleted: sha256:f387efc80b493fe0a1224ef8805c76baae0605e77589a2eab04d9cd622dda9fc
Deleted: sha256:99aeac6db9a6d0fa07162a18caef2f808ca66ee6d8522d07a37b456d62fe09f8
Deleted: sha256:d2802ccad81f2af02d5dc1f6be47c4d730415bcf1b1e8a2949b62ed0bc1da144
Deleted: sha256:5bbd6ae1ced6d50f9c6bc24a2f55b0790fce7053682be2fca21c69a2cce6ae34
Deleted: sha256:eaa3d6a9a78b96d5d2ce0fe16984c033d4e7f6a9826e4f51c35b941834bf4d3d
Deleted: sha256:ba6bb65ff579af296acfe19f99c2a89b46dc995dd9a5aa446cbfdf3441273fd9
Deleted: sha256:f937de91e229d4fe39a37b2d1c672401dd3500fbc2f2bad861e51d048ebdc9ac
Deleted: sha256:3fe45089555791942d234ad89ebaa6e49682ec9d2b3af94641f9ffea7355b47a
Deleted: sha256:1e7f71ab9c62b300236f1b9f2527bbaa0e123041b64d1cf960aa19f549a48823
Deleted: sha256:585d6a059171f40ba28d513755e28156e89c54e26de2671db1c8fb4acec88c82
Deleted: sha256:4bff3a4e4d81a016452a3eb1f7ab7b101e9475d6e095ead9a5a53931193f9605
Deleted: sha256:df7cc9fcf50a5a949e8fcf9a4928d36d5bafe1a14aa8e5d4ecfdc9a2ed6b9abd
Deleted: sha256:8ae7b0a18d9c523a8986c8b8b626add0f19ecde8916a298f108f35a5adf7530c
Deleted: sha256:cb1c39d68b8c49bf58f5050b943405ff6ec3fe3bba0edd40b6370ae0f0bf3df4
Deleted: sha256:35d242108c9bf3c1462f795197565384d9b5868606db490b7ca859656f35ce6e
Deleted: sha256:11f423f6e1ddc043f76cfc1731ea8507dd97bba3b83e227e4c499cd600ef8edd
Deleted: sha256:f325f3de29b620a5dc45bec9efd7ccf9045eabebffb236d58bcaf699d8d48b81
Deleted: sha256:48996e7a56d2d33e252127526801f3b32ddd5bea9dc78c8cb618688ac8f2680c
Deleted: sha256:827389f7c1f70a6ee1a639de1a689a9f9d2a712355b070ea23e79efb5c1daea9
Deleted: sha256:e2dcc890623d85e6e7d9be393ef2190a89596c86daeccca17b41f30e539e39b7
Deleted: sha256:dfed85478139f234b18532f38ef48a5886439dc42fa3a0b0ac2e96b28825b64f
Build step 'Execute shell' marked build as failure

Jenkins build is back to normal : mesos-reviewbot #16394

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/mesos-reviewbot/16394/>