See <https://builds.apache.org/job/Mesos-Buildbot/BUILDTOOL=autotools,COMPILER=gcc,CONFIGURATION=--verbose%20--enable-libevent%20--enable-ssl,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=centos%3A7,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2)/3638/display/redirect?page=changes>
Changes: [vinodkone] Add new MUG for Tokyo. ------------------------------------------ [...truncated 28.18 MB...] I0509 17:10:23.141093 18930 master.cpp:502] Master only allowing authenticated agents to register I0509 17:10:23.141098 18930 master.cpp:515] Master only allowing authenticated HTTP frameworks to register I0509 17:10:23.141106 18930 credentials.hpp:37] Loading credentials for authentication from '/tmp/QgXIDm/credentials' I0509 17:10:23.141373 18930 master.cpp:560] Using default 'crammd5' authenticator I0509 17:10:23.141507 18930 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-master-readonly' I0509 17:10:23.141683 18930 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-master-readwrite' I0509 17:10:23.141842 18930 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-master-scheduler' I0509 17:10:23.141978 18930 master.cpp:640] Authorization enabled I0509 17:10:23.142139 18924 hierarchical.cpp:158] Initialized hierarchical allocator process I0509 17:10:23.142174 18932 whitelist_watcher.cpp:77] No whitelist given I0509 17:10:23.144489 18925 master.cpp:2161] Elected as the leading master! I0509 17:10:23.144521 18925 master.cpp:1700] Recovering from registrar I0509 17:10:23.144681 18931 registrar.cpp:345] Recovering registrar I0509 17:10:23.146811 18919 registrar.cpp:389] Successfully fetched the registry (0B) in 2080us I0509 17:10:23.146958 18919 registrar.cpp:493] Applied 1 operations in 30498ns; attempting to update the registry I0509 17:10:23.149063 18919 registrar.cpp:550] Successfully updated the registry in 2.044928ms I0509 17:10:23.149186 18919 registrar.cpp:422] Successfully recovered registrar I0509 17:10:23.149613 18923 master.cpp:1799] Recovered 0 agents from the registry (129B); allowing 10mins for agents to re-register I0509 17:10:23.149758 18919 hierarchical.cpp:185] Skipping recovery of hierarchical allocator: nothing to recover I0509 17:10:23.157670 1433 cluster.cpp:448] Creating default 'local' authorizer I0509 17:10:23.159327 18923 slave.cpp:225] Mesos agent started on (747)@172.17.0.2:37663 I0509 17:10:23.159350 18923 slave.cpp:226] Flags at startup: --acls="" --appc_simple_discovery_uri_prefix="http://"; --appc_store_dir="/tmp/mesos/store/appc" --authenticate_http_executors="true" --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/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_6p22VP/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_secret_key="/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_6p22VP/executor_secret_key" --executor_shutdown_grace_period="5secs" --fetcher_cache_dir="/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_6p22VP/fetch" --fetcher_cache_size="2GB" --frameworks_home="" --gc_delay="1weeks" --gc_disk_headroom="0.1" --hadoop_home="" --help="false" --hostname_lookup="true" --http_command_executor="false" --http_credentials="/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_6p22VP/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.4.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --port="5051" --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/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_6p22VP" --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/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_NqfShB" I0509 17:10:23.159818 18923 credentials.hpp:86] Loading credential for authentication from '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_6p22VP/credential' I0509 17:10:23.159973 1433 scheduler.cpp:184] Version: 1.4.0 I0509 17:10:23.160046 18923 slave.cpp:258] Agent using credential for: test-principal I0509 17:10:23.160070 18923 credentials.hpp:37] Loading credentials for authentication from '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_6p22VP/http_credentials' I0509 17:10:23.160555 18923 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-agent-executor' I0509 17:10:23.160715 18923 http.cpp:996] Creating default 'jwt' HTTP authenticator for realm 'mesos-agent-executor' I0509 17:10:23.160933 18929 scheduler.cpp:470] New master detected at [email protected]:37663 I0509 17:10:23.160953 18923 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-agent-readonly' I0509 17:10:23.161069 18923 http.cpp:996] Creating default 'jwt' HTTP authenticator for realm 'mesos-agent-readonly' I0509 17:10:23.161264 18923 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite' I0509 17:10:23.161370 18923 http.cpp:996] Creating default 'jwt' HTTP authenticator for realm 'mesos-agent-readwrite' I0509 17:10:23.162679 18929 scheduler.cpp:479] Waiting for 0ns before initiating a re-(connection) attempt with the master I0509 17:10:23.162850 18923 slave.cpp:525] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] I0509 17:10:23.162971 18923 slave.cpp:533] Agent attributes: [ ] I0509 17:10:23.162993 18923 slave.cpp:538] Agent hostname: f09954bfa156 I0509 17:10:23.163332 18920 status_update_manager.cpp:177] Pausing sending status updates I0509 17:10:23.165094 18931 state.cpp:62] Recovering state from '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_NqfShB/meta' I0509 17:10:23.165171 18920 scheduler.cpp:361] Connected with the master at http://172.17.0.2:37663/master/api/v1/scheduler I0509 17:10:23.165630 18923 status_update_manager.cpp:203] Recovering status update manager I0509 17:10:23.166257 18922 slave.cpp:5963] Finished recovery I0509 17:10:23.166663 18921 scheduler.cpp:243] Sending SUBSCRIBE call to http://172.17.0.2:37663/master/api/v1/scheduler I0509 17:10:23.166820 18922 slave.cpp:6145] Querying resource estimator for oversubscribable resources I0509 17:10:23.167078 18922 slave.cpp:6159] Received oversubscribable resources {} from the resource estimator I0509 17:10:23.167356 18920 status_update_manager.cpp:177] Pausing sending status updates I0509 17:10:23.167379 18924 slave.cpp:918] New master detected at [email protected]:37663 I0509 17:10:23.167503 18924 slave.cpp:953] Detecting new master I0509 17:10:23.168078 18920 process.cpp:3730] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler' I0509 17:10:23.168598 18921 slave.cpp:980] Authenticating with master [email protected]:37663 I0509 17:10:23.168675 18921 slave.cpp:991] Using default CRAM-MD5 authenticatee I0509 17:10:23.169075 18930 authenticatee.cpp:121] Creating new client SASL connection I0509 17:10:23.169519 18928 master.cpp:7475] Authenticating slave(747)@172.17.0.2:37663 I0509 17:10:23.169651 18929 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(1390)@172.17.0.2:37663 I0509 17:10:23.170070 18926 http.cpp:1115] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:53630 I0509 17:10:23.170171 18918 authenticator.cpp:98] Creating new server SASL connection I0509 17:10:23.172063 18926 master.cpp:2513] Received subscription request for HTTP framework 'default' I0509 17:10:23.172153 18926 master.cpp:2197] Authorizing framework principal 'test-principal' to receive offers for roles '{ * }' I0509 17:10:23.172644 18923 master.cpp:2628] Subscribing framework 'default' with checkpointing disabled and capabilities [ ] I0509 17:10:23.172683 18917 authenticatee.cpp:213] Received SASL authentication mechanisms: CRAM-MD5 I0509 17:10:23.172986 18917 authenticatee.cpp:239] Attempting to authenticate with mechanism 'CRAM-MD5' I0509 17:10:23.173163 18917 authenticator.cpp:204] Received SASL authentication start I0509 17:10:23.173337 18917 authenticator.cpp:326] Authentication requires more steps I0509 17:10:23.173550 18927 hierarchical.cpp:273] Added framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.173596 18925 authenticatee.cpp:259] Received SASL authentication step I0509 17:10:23.173730 18927 hierarchical.cpp:1850] No allocations performed I0509 17:10:23.173784 18932 authenticator.cpp:232] Received SASL authentication step I0509 17:10:23.173789 18927 hierarchical.cpp:1940] No inverse offers to send out! I0509 17:10:23.173830 18932 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'f09954bfa156' server FQDN: 'f09954bfa156' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false I0509 17:10:23.173851 18932 auxprop.cpp:181] Looking up auxiliary property '*userPassword' I0509 17:10:23.173889 18932 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5' I0509 17:10:23.173882 18927 hierarchical.cpp:1434] Performed allocation for 0 agents in 199879ns I0509 17:10:23.173918 18932 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'f09954bfa156' server FQDN: 'f09954bfa156' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true I0509 17:10:23.173928 18932 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since SASL_AUXPROP_AUTHZID == true I0509 17:10:23.173935 18932 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5' since SASL_AUXPROP_AUTHZID == true I0509 17:10:23.173955 18932 authenticator.cpp:318] Authentication success I0509 17:10:23.174160 18932 authenticatee.cpp:299] Authentication success I0509 17:10:23.174264 18932 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(1390)@172.17.0.2:37663 I0509 17:10:23.174597 18932 slave.cpp:1075] Successfully authenticated with master [email protected]:37663 I0509 17:10:23.174790 18932 slave.cpp:1503] Will retry registration in 18.002055ms if necessary I0509 17:10:23.175709 18932 scheduler.cpp:676] Enqueuing event SUBSCRIBED received from http://172.17.0.2:37663/master/api/v1/scheduler I0509 17:10:23.176761 18932 master.hpp:2194] Sending heartbeat to 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.176789 18923 master.cpp:7505] Successfully authenticated principal 'test-principal' at slave(747)@172.17.0.2:37663 I0509 17:10:23.177105 18923 master.cpp:5429] Received register agent message from slave(747)@172.17.0.2:37663 (f09954bfa156) I0509 17:10:23.177270 18923 master.cpp:3659] Authorizing agent with principal 'test-principal' I0509 17:10:23.177789 18920 master.cpp:5564] Registering agent at slave(747)@172.17.0.2:37663 (f09954bfa156) with id 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 I0509 17:10:23.177880 18930 scheduler.cpp:676] Enqueuing event HEARTBEAT received from http://172.17.0.2:37663/master/api/v1/scheduler I0509 17:10:23.178450 18917 registrar.cpp:493] Applied 1 operations in 83968ns; attempting to update the registry I0509 17:10:23.180702 18917 registrar.cpp:550] Successfully updated the registry in 2.185984ms I0509 17:10:23.181404 18921 slave.cpp:4745] Received ping from slave-observer(680)@172.17.0.2:37663 I0509 17:10:23.181475 18923 master.cpp:5639] Registered agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) with cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] I0509 17:10:23.182003 18926 hierarchical.cpp:525] Added agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 (f09954bfa156) with cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] (allocated: {}) I0509 17:10:23.183646 18926 hierarchical.cpp:1940] No inverse offers to send out! I0509 17:10:23.183704 18926 hierarchical.cpp:1434] Performed allocation for 1 agents in 1.562807ms I0509 17:10:23.183815 18921 slave.cpp:1121] Registered with master [email protected]:37663; given agent ID 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 I0509 17:10:23.183846 18921 fetcher.cpp:94] Clearing fetcher cache I0509 17:10:23.184029 18928 status_update_manager.cpp:184] Resuming sending status updates I0509 17:10:23.184239 18918 master.cpp:7305] Sending 1 offers to framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (default) I0509 17:10:23.184299 18921 slave.cpp:1149] Checkpointing SlaveInfo to '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_NqfShB/meta/slaves/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0/slave.info' I0509 17:10:23.184729 18921 slave.cpp:1187] Forwarding total oversubscribed resources {} I0509 17:10:23.185482 18918 master.cpp:6324] Received update of agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) with total oversubscribed resources {} I0509 17:10:23.187999 18917 scheduler.cpp:676] Enqueuing event OFFERS received from http://172.17.0.2:37663/master/api/v1/scheduler I0509 17:10:23.190560 18917 scheduler.cpp:243] Sending ACCEPT call to http://172.17.0.2:37663/master/api/v1/scheduler I0509 17:10:23.192453 18920 process.cpp:3730] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler' I0509 17:10:23.194124 18926 http.cpp:1115] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:53629 I0509 17:10:23.196380 18926 master.cpp:3875] Processing ACCEPT call for offers: [ 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-O0 ] on agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) for framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (default) I0509 17:10:23.196521 18926 master.cpp:3426] Authorizing framework principal 'test-principal' to launch task aa7d3963-79a7-4282-9d42-468cc002a272 W0509 17:10:23.199139 18923 validation.cpp:1284] Executor 'default' for task 'aa7d3963-79a7-4282-9d42-468cc002a272' uses less CPUs (None) than the minimum required (0.01). Please update your executor, as this will be mandatory in future releases. W0509 17:10:23.199177 18923 validation.cpp:1296] Executor 'default' for task 'aa7d3963-79a7-4282-9d42-468cc002a272' uses less memory (None) than the minimum required (32MB). Please update your executor, as this will be mandatory in future releases. I0509 17:10:23.199699 18923 master.cpp:9326] Adding task aa7d3963-79a7-4282-9d42-468cc002a272 with resources cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] on agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) I0509 17:10:23.200031 18923 master.cpp:4531] Launching task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (default) with resources cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] on agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) I0509 17:10:23.200711 18924 slave.cpp:1613] Got assigned task 'aa7d3963-79a7-4282-9d42-468cc002a272' for framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.201766 18924 slave.cpp:1894] Authorizing task 'aa7d3963-79a7-4282-9d42-468cc002a272' for framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.202044 18924 slave.cpp:6582] Authorizing framework principal 'test-principal' to launch task aa7d3963-79a7-4282-9d42-468cc002a272 I0509 17:10:23.203369 18926 slave.cpp:2081] Launching task 'aa7d3963-79a7-4282-9d42-468cc002a272' for framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.203790 18922 hierarchical.cpp:850] Updated allocation of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 on agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 from cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] to cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] I0509 17:10:23.203980 18926 paths.cpp:573] Trying to chown '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_NqfShB/slaves/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0/frameworks/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000/executors/default/runs/d8779779-e33c-49c1-ac8c-2b7bdc11f451' to user 'mesos' I0509 17:10:23.204267 18926 slave.cpp:6922] Launching executor 'default' of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 with resources {} in work directory '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_NqfShB/slaves/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0/frameworks/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000/executors/default/runs/d8779779-e33c-49c1-ac8c-2b7bdc11f451' I0509 17:10:23.205121 18926 slave.cpp:2310] Queued task 'aa7d3963-79a7-4282-9d42-468cc002a272' for executor 'default' of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.205194 18926 slave.cpp:871] Successfully attached file '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_NqfShB/slaves/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0/frameworks/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000/executors/default/runs/d8779779-e33c-49c1-ac8c-2b7bdc11f451' I0509 17:10:23.207649 18925 executor.cpp:192] Version: 1.4.0 I0509 17:10:23.209862 18920 executor.cpp:410] Connected with the agent I0509 17:10:23.210577 18931 executor.cpp:307] Sending SUBSCRIBE call to http://172.17.0.2:37663/slave(747)/api/v1/executor I0509 17:10:23.211664 18926 process.cpp:3730] Handling HTTP event for process 'slave(747)' with path: '/slave(747)/api/v1/executor' I0509 17:10:23.214634 18927 http.cpp:1115] HTTP POST for /slave(747)/api/v1/executor from 172.17.0.2:53633 I0509 17:10:23.214829 18927 slave.cpp:3568] Received Subscribe request for HTTP executor 'default' of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.216248 18927 slave.cpp:2523] Sending queued task 'aa7d3963-79a7-4282-9d42-468cc002a272' to executor 'default' of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (via HTTP) I0509 17:10:23.217861 18925 executor.cpp:725] Enqueuing event SUBSCRIBED received from http://172.17.0.2:37663/slave(747)/api/v1/executor I0509 17:10:23.218641 18927 executor.cpp:725] Enqueuing event LAUNCH received from http://172.17.0.2:37663/slave(747)/api/v1/executor I0509 17:10:23.219657 18917 executor.cpp:307] Sending UPDATE call to http://172.17.0.2:37663/slave(747)/api/v1/executor I0509 17:10:23.220518 18921 process.cpp:3730] Handling HTTP event for process 'slave(747)' with path: '/slave(747)/api/v1/executor' I0509 17:10:23.223026 18917 http.cpp:1115] HTTP POST for /slave(747)/api/v1/executor from 172.17.0.2:53634 I0509 17:10:23.223227 18917 slave.cpp:4215] Handling status update TASK_RUNNING (UUID: b9bb2473-76d3-4a0c-a76c-33e5f0a52b21) for task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.224031 18927 status_update_manager.cpp:323] Received status update TASK_RUNNING (UUID: b9bb2473-76d3-4a0c-a76c-33e5f0a52b21) for task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.224124 18927 status_update_manager.cpp:500] Creating StatusUpdate stream for task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.224687 18927 status_update_manager.cpp:377] Forwarding update TASK_RUNNING (UUID: b9bb2473-76d3-4a0c-a76c-33e5f0a52b21) for task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 to the agent I0509 17:10:23.224979 18932 slave.cpp:4655] Forwarding the update TASK_RUNNING (UUID: b9bb2473-76d3-4a0c-a76c-33e5f0a52b21) for task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 to [email protected]:37663 I0509 17:10:23.225280 18932 slave.cpp:4549] Status update manager successfully handled status update TASK_RUNNING (UUID: b9bb2473-76d3-4a0c-a76c-33e5f0a52b21) for task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.225472 18923 master.cpp:6469] Status update TASK_RUNNING (UUID: b9bb2473-76d3-4a0c-a76c-33e5f0a52b21) for task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 from agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) I0509 17:10:23.225534 18923 master.cpp:6537] Forwarding status update TASK_RUNNING (UUID: b9bb2473-76d3-4a0c-a76c-33e5f0a52b21) for task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.226207 18923 master.cpp:8568] Updating the state of task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (latest state: TASK_RUNNING, status update state: TASK_RUNNING) I0509 17:10:23.226459 18931 executor.cpp:725] Enqueuing event ACKNOWLEDGED received from http://172.17.0.2:37663/slave(747)/api/v1/executor I0509 17:10:23.227748 18923 scheduler.cpp:676] Enqueuing event UPDATE received from http://172.17.0.2:37663/master/api/v1/scheduler I0509 17:10:23.229053 18923 scheduler.cpp:243] Sending TEARDOWN call to http://172.17.0.2:37663/master/api/v1/scheduler I0509 17:10:23.230149 18931 process.cpp:3730] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler' I0509 17:10:23.267568 18931 http.cpp:1115] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:53629 I0509 17:10:23.267861 18931 master.cpp:8000] Removing framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (default) I0509 17:10:23.267895 18931 master.cpp:3160] Deactivating framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (default) I0509 17:10:23.268097 18922 hierarchical.cpp:374] Deactivated framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.268146 18930 slave.cpp:3057] Asked to shut down framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 by [email protected]:37663 I0509 17:10:23.268187 18931 master.cpp:8568] Updating the state of task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (latest state: TASK_KILLED, status update state: TASK_KILLED) I0509 17:10:23.268290 18930 slave.cpp:3082] Shutting down framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.268379 18930 slave.cpp:5475] Shutting down executor 'default' of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (via HTTP) I0509 17:10:23.269076 18931 master.cpp:8662] Removing task aa7d3963-79a7-4282-9d42-468cc002a272 with resources cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 on agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) I0509 17:10:23.269444 18930 executor.cpp:725] Enqueuing event SHUTDOWN received from http://172.17.0.2:37663/slave(747)/api/v1/executor I0509 17:10:23.269470 18931 master.cpp:8691] Removing executor 'default' with resources {} of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 on agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) I0509 17:10:23.269980 18932 hierarchical.cpp:1114] Recovered cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] (total: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000], allocated: {}) on agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 from framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.270586 18932 hierarchical.cpp:325] Removed framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 E0509 17:10:23.271215 18924 scheduler.cpp:649] End-Of-File received from master. The master closed the event stream I0509 17:10:23.271620 18930 scheduler.cpp:444] Re-detecting master I0509 17:10:23.272217 18930 scheduler.cpp:395] Ignoring disconnection attempt from stale connection I0509 17:10:23.272339 18930 scheduler.cpp:395] Ignoring disconnection attempt from stale connection I0509 17:10:23.272439 18930 scheduler.cpp:470] New master detected at [email protected]:37663 I0509 17:10:23.274272 18930 scheduler.cpp:479] Waiting for 0ns before initiating a re-(connection) attempt with the master I0509 17:10:23.276834 18927 slave.cpp:5161] Executor 'default' of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 exited with status 0 I0509 17:10:23.277009 18927 slave.cpp:5261] Cleaning up executor 'default' of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (via HTTP) W0509 17:10:23.277138 18919 master.cpp:6592] Ignoring unknown exited executor 'default' of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 on agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) I0509 17:10:23.277463 18928 gc.cpp:55] Scheduling '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_NqfShB/slaves/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0/frameworks/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000/executors/default/runs/d8779779-e33c-49c1-ac8c-2b7bdc11f451' for gc 6.99999678964148days in the future I0509 17:10:23.277660 18927 slave.cpp:5349] Cleaning up framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.277660 18931 gc.cpp:55] Scheduling '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_NqfShB/slaves/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0/frameworks/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000/executors/default' for gc 6.99999678711704days in the future I0509 17:10:23.278038 18932 status_update_manager.cpp:285] Closing status update streams for framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.278095 18932 status_update_manager.cpp:531] Cleaning up status update stream for task aa7d3963-79a7-4282-9d42-468cc002a272 of framework 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 I0509 17:10:23.278131 18928 gc.cpp:55] Scheduling '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_3_NqfShB/slaves/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0/frameworks/03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000' for gc 6.99999678167704days in the future I0509 17:10:23.278177 18927 slave.cpp:790] Agent terminating I0509 17:10:23.278522 18931 master.cpp:1313] Agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) disconnected I0509 17:10:23.278573 18931 master.cpp:3197] Disconnecting agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) I0509 17:10:23.278897 18931 master.cpp:3216] Deactivating agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 at slave(747)@172.17.0.2:37663 (f09954bfa156) I0509 17:10:23.279040 18922 hierarchical.cpp:653] Agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 deactivated I0509 17:10:23.281328 18921 master.cpp:1155] Master terminating I0509 17:10:23.281937 18920 hierarchical.cpp:558] Removed agent 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-S0 W0509 17:10:23.283430 1433 master.hpp:2677] Failed to close HTTP pipe for 03fa4b85-13d5-4a30-9d9d-9704ae85dea2-0000 (default) [ OK ] ContentTypeAndSSLConfig/SchedulerSSLTest.RunTaskAndTeardown/3 (153 ms) E0509 17:10:23.287585 18933 process.cpp:950] Failed to accept socket: future discarded I0509 17:10:23.293468 1433 process.cpp:1266] libprocess is initialized on 172.17.0.2:40036 with 16 worker threads [----------] 4 tests from ContentTypeAndSSLConfig/SchedulerSSLTest (1818 ms total) [----------] 9 tests from Endpoint/SlaveEndpointTest *** Aborted at 1494349823 (unix time) try "date -d @1494349823" if you are using GNU date *** PC: @ 0x7f410f4d111a __GI_strcmp *** SIGSEGV (@0x0) received by PID 1433 (TID 0x7f411afb78c0) from PID 0; stack trace: *** @ 0x7f40fe10dfc5 (unknown) @ 0x7f40fe1132c1 (unknown) @ 0x7f40fe1070a8 (unknown) @ 0x7f4110449370 (unknown) @ 0x7f410f4d111a __GI_strcmp @ 0x7f410f53f7b0 __tfind @ 0x7f410f48441c __add_to_environ @ 0x7f4118fbff71 os::setenv() @ 0x7f41196ae1e0 mesos::internal::tests::MesosTest::SetUpTestCase() @ 0x7f411a09bbc8 testing::TestCase::RunSetUpTestCase() @ 0x7f411a0a5b1f testing::internal::HandleSehExceptionsInMethodIfSupported<>() @ 0x7f411a0a0d16 testing::internal::HandleExceptionsInMethodIfSupported<>() @ 0x7f411a082bad testing::TestCase::Run() @ 0x7f411a0894b2 testing::internal::UnitTestImpl::RunAllTests() @ 0x7f411a0a624f testing::internal::HandleSehExceptionsInMethodIfSupported<>() @ 0x7f411a0a1290 testing::internal::HandleExceptionsInMethodIfSupported<>() @ 0x7f411a0881f8 testing::UnitTest::Run() @ 0x7f41193f90a3 RUN_ALL_TESTS() @ 0x7f41193f8b74 main @ 0x7f410f46db35 __libc_start_main @ 0x7f4118ba7ad9 (unknown) make[4]: *** [check-local] Segmentation fault make[4]: Leaving directory `/mesos/mesos-1.4.0/_build/src' make[3]: *** [check-am] Error 2 make[3]: Leaving directory `/mesos/mesos-1.4.0/_build/src' make[2]: *** [check] Error 2 make[2]: Leaving directory `/mesos/mesos-1.4.0/_build/src' make[1]: *** [check-recursive] Error 1 make[1]: Leaving directory `/mesos/mesos-1.4.0/_build' make: *** [distcheck] Error 1 + docker rmi mesos-1494347233-25127 Untagged: mesos-1494347233-25127:latest Deleted: sha256:b5ec8327bd9526440c821e37ad28f188b16463ea6b50bd1355bf3471e9ff92d3 Deleted: sha256:062cd87b685b107c223e02744117de28d13f4a2271460175f9e0d894615770b8 Deleted: sha256:26e40d240e6f2e4e4b4650cfda0f5a8efe971143e3c84f6657cfc08e76fc88a6 Deleted: sha256:16c5f1316d4b29cac40ec7abec82b44310380ff0a18b0a55a62483cb102e8320 Deleted: sha256:cbe62b5d27322304efb17aa5623e45988cdd5d3b26ddfd369fe0edcfe65111b9 Deleted: sha256:dcc9bd51f517919606cd13717b96ece4ffc40551a9506b4f0f9944816a3726a7 Deleted: sha256:c9a2826b9172b13ebb2a1a4fd074cd5ef525fc52493925415bdadf97ca21739c Deleted: sha256:14dfaa1f1717875ab4b5d1cd64655acfce7c33379e845682afc0058063148344 Deleted: sha256:81593bc7be092f473b1eef492bf9469ae0bb00153589f51bc79a45a163ef2e00 Deleted: sha256:5a5e4ff7c37fe99223654a7051831f2b4e6f9a94bc20716f1ef9da7da2f8b0a8 Deleted: sha256:6b4ce86dfa9d978878ae603f0ae9edbc6180cf56d65093a72b9782a58f8a5a32 Deleted: sha256:cd17f57977cff24ee06c5665f15829506a3bbf34c8b7ee4e1dd1c5228734b745 Deleted: sha256:debe4ceae836b041e718aaae29c657811e41eda4e91b89d51107dad66e7936cd Deleted: sha256:39917cb548510508f11a5e1692ddc84eebab7aaae330a1860206ee7a3a9b4aab Deleted: sha256:411502e01bd14438e3d78340d42f4b628aebcdff4281f07509343162cb255069 Deleted: sha256:c0c418f2f34675eebc47a40aaabfd109ef32c6ce17945bf80a82807f5a34bba7 Deleted: sha256:42a33870a767a840514ab2d1d20a11673ed0e26f5bceba3a7fe9b71ce6fb2126 Deleted: sha256:6e5847749fe5aed3ecbd0eb010ff1762c0d9fa64333c0da83679fc5c7ef60a18 Deleted: sha256:7d1f25c7b975a33052a919564c8b5c7f407914332296c0b4b5ed86b7b7722c21 Deleted: sha256:b64a1d74a0ee249a262dfbd80bc3e580584756cfe16b10944be2ec5d9d594763 Deleted: sha256:df7580e85c89b238ec7a92eb6cae6c322cd48209550ac8cd6e2091e17eb02ce1 Deleted: sha256:b0e5afabe70667fb7b167a2b91885babf2ba4da37b10cd8ced4c0650a815ee14 Deleted: sha256:f97c37e3833e25dd424e6a655824852f73ce77c02d77c0fe20b05c170557acbc Deleted: sha256:8d1d6ef68dee51dea433a0142198e3ea47d27ebe7e0bc6870d4e17003e85809b Deleted: sha256:c05bc7b66f32e7089b85d61331230f84ea5c729208553d4650b8b88d1b9cb270 Build step 'Execute shell' marked build as failure Not sending mail to unregistered user [email protected]
