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/14 12:11:32 UTC
Build failed in Jenkins: Mesos » cmake,clang,--verbose --enable-libevent --enable-ssl,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2) #3036
See <https://builds.apache.org/job/Mesos/BUILDTOOL=cmake,COMPILER=clang,CONFIGURATION=--verbose%20--enable-libevent%20--enable-ssl,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2)/3036/>
------------------------------------------
[...truncated 169970 lines...]
I1214 12:11:15.445559 25239 gc.cpp:55] Scheduling '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_TRf99B/slaves/6297288f-9d45-41fd-97d3-d43b8c6ffaa0-S0/frameworks/6297288f-9d45-41fd-97d3-d43b8c6ffaa0-0000/executors/default' for gc 6.99999484342518days in the future
I1214 12:11:15.445602 25231 status_update_manager.cpp:285] Closing status update streams for framework 6297288f-9d45-41fd-97d3-d43b8c6ffaa0-0000
I1214 12:11:15.445662 25231 status_update_manager.cpp:531] Cleaning up status update stream for task 2a35c0f6-fe07-4c1c-be69-b362349a3103 of framework 6297288f-9d45-41fd-97d3-d43b8c6ffaa0-0000
I1214 12:11:15.445693 25244 gc.cpp:55] Scheduling '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_TRf99B/slaves/6297288f-9d45-41fd-97d3-d43b8c6ffaa0-S0/frameworks/6297288f-9d45-41fd-97d3-d43b8c6ffaa0-0000' for gc 6.99999484209481days in the future
I1214 12:11:15.446272 25230 slave.cpp:796] Agent terminating
I1214 12:11:15.447657 25230 master.cpp:1097] Master terminating
I1214 12:11:15.448966 25241 hierarchical.cpp:522] Removed agent 6297288f-9d45-41fd-97d3-d43b8c6ffaa0-S0
W1214 12:11:15.451846 25230 master.hpp:2531] Failed to close HTTP pipe for 6297288f-9d45-41fd-97d3-d43b8c6ffaa0-0000 (default)
I1214 12:11:15.459581 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1214 12:11:15.460026 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1214 12:11:15.460126 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 12:11:15.462271 25232 slave.cpp:209] Mesos agent started on (666)@172.17.0.3:57378
I1214 12:11:15.462304 25232 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/Endpoint_SlaveEndpointTest_AuthorizedRequest_0_9c6jEP/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_0_9c6jEP/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_0_9c6jEP/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_0_9c6jEP" --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/Endpoint_SlaveEndpointTest_AuthorizedRequest_0_GOgFV7"
I1214 12:11:15.462678 25232 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_0_9c6jEP/credential'
I1214 12:11:15.462810 25232 slave.cpp:352] Agent using credential for: test-principal
I1214 12:11:15.462827 25232 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_0_9c6jEP/http_credentials'
I1214 12:11:15.462950 25232 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 12:11:15.463004 25232 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1214 12:11:15.463464 25232 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1214 12:11:15.463510 25232 slave.cpp:547] Agent attributes: [ ]
I1214 12:11:15.463517 25232 slave.cpp:552] Agent hostname: 980181492b15
I1214 12:11:15.464074 25241 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_0_GOgFV7/meta'
I1214 12:11:15.464331 25241 status_update_manager.cpp:203] Recovering status update manager
I1214 12:11:15.464574 25240 containerizer.cpp:594] Recovering containerizer
I1214 12:11:15.465323 25240 provisioner.cpp:253] Provisioner recovery complete
I1214 12:11:15.465662 25235 slave.cpp:5420] Finished recovery
I1214 12:11:15.466223 25235 slave.cpp:5594] Querying resource estimator for oversubscribable resources
I1214 12:11:15.466450 25244 slave.cpp:5608] Received oversubscribable resources {} from the resource estimator
I1214 12:11:15.468080 25240 process.cpp:3679] Handling HTTP event for process 'slave(666)' with path: '/slave(666)/monitor/statistics'
I1214 12:11:15.468583 25240 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
I1214 12:11:15.470013 25245 slave.cpp:796] Agent terminating
I1214 12:11:15.483184 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1214 12:11:15.483628 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1214 12:11:15.483741 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 12:11:15.485535 25241 slave.cpp:209] Mesos agent started on (667)@172.17.0.3:57378
I1214 12:11:15.485976 25241 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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_4jNyJE/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_4jNyJE/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_4jNyJE/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_4jNyJE" --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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_S213WW"
I1214 12:11:15.486506 25241 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_4jNyJE/credential'
I1214 12:11:15.486743 25241 slave.cpp:352] Agent using credential for: test-principal
I1214 12:11:15.486845 25241 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_4jNyJE/http_credentials'
I1214 12:11:15.487047 25241 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 12:11:15.487210 25241 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1214 12:11:15.487782 25241 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1214 12:11:15.487932 25241 slave.cpp:547] Agent attributes: [ ]
I1214 12:11:15.488032 25241 slave.cpp:552] Agent hostname: 980181492b15
I1214 12:11:15.488656 25241 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_S213WW/meta'
I1214 12:11:15.488904 25241 status_update_manager.cpp:203] Recovering status update manager
I1214 12:11:15.489167 25238 containerizer.cpp:594] Recovering containerizer
I1214 12:11:15.489790 25238 provisioner.cpp:253] Provisioner recovery complete
I1214 12:11:15.490021 25238 slave.cpp:5420] Finished recovery
I1214 12:11:15.490644 25238 slave.cpp:5594] Querying resource estimator for oversubscribable resources
I1214 12:11:15.490874 25238 slave.cpp:5608] Received oversubscribable resources {} from the resource estimator
I1214 12:11:15.492753 25239 process.cpp:3679] Handling HTTP event for process 'slave(667)' with path: '/slave(667)/monitor/statistics.json'
I1214 12:11:15.493263 25239 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I1214 12:11:15.494931 25231 slave.cpp:796] Agent terminating
I1214 12:11:15.501480 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1214 12:11:15.501915 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1214 12:11:15.502028 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 12:11:15.503588 25242 slave.cpp:209] Mesos agent started on (668)@172.17.0.3:57378
I1214 12:11:15.503624 25242 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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_6NWF1t/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_6NWF1t/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_6NWF1t/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_6NWF1t" --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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_XgzdcM"
I1214 12:11:15.504045 25242 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_6NWF1t/credential'
I1214 12:11:15.504180 25242 slave.cpp:352] Agent using credential for: test-principal
I1214 12:11:15.504199 25242 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_6NWF1t/http_credentials'
I1214 12:11:15.504328 25242 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 12:11:15.504384 25242 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1214 12:11:15.504817 25242 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1214 12:11:15.504864 25242 slave.cpp:547] Agent attributes: [ ]
I1214 12:11:15.504878 25242 slave.cpp:552] Agent hostname: 980181492b15
I1214 12:11:15.505719 25242 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_XgzdcM/meta'
I1214 12:11:15.505919 25244 status_update_manager.cpp:203] Recovering status update manager
I1214 12:11:15.506136 25244 containerizer.cpp:594] Recovering containerizer
I1214 12:11:15.506948 25242 provisioner.cpp:253] Provisioner recovery complete
I1214 12:11:15.507141 25244 slave.cpp:5420] Finished recovery
I1214 12:11:15.507624 25244 slave.cpp:5594] Querying resource estimator for oversubscribable resources
I1214 12:11:15.507781 25244 slave.cpp:5608] Received oversubscribable resources {} from the resource estimator
I1214 12:11:15.508743 25245 process.cpp:3679] Handling HTTP event for process 'slave(668)' with path: '/slave(668)/containers'
I1214 12:11:15.509224 25242 http.cpp:874] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I1214 12:11:15.515974 25242 slave.cpp:796] Agent terminating
I1214 12:11:15.544909 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1214 12:11:15.545521 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1214 12:11:15.545755 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 12:11:15.547431 25231 slave.cpp:209] Mesos agent started on (669)@172.17.0.3:57378
I1214 12:11:15.547466 25231 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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_c6LEHj/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_c6LEHj/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_c6LEHj/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_c6LEHj" --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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_iuC9KB"
I1214 12:11:15.547855 25231 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_c6LEHj/credential'
I1214 12:11:15.547981 25231 slave.cpp:352] Agent using credential for: test-principal
I1214 12:11:15.547996 25231 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_c6LEHj/http_credentials'
I1214 12:11:15.548107 25231 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 12:11:15.548162 25231 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1214 12:11:15.548604 25231 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1214 12:11:15.548646 25231 slave.cpp:547] Agent attributes: [ ]
I1214 12:11:15.548653 25231 slave.cpp:552] Agent hostname: 980181492b15
I1214 12:11:15.549248 25243 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_iuC9KB/meta'
I1214 12:11:15.549409 25243 status_update_manager.cpp:203] Recovering status update manager
I1214 12:11:15.549469 25243 containerizer.cpp:594] Recovering containerizer
I1214 12:11:15.550005 25243 provisioner.cpp:253] Provisioner recovery complete
I1214 12:11:15.550148 25243 slave.cpp:5420] Finished recovery
I1214 12:11:15.550616 25243 slave.cpp:5594] Querying resource estimator for oversubscribable resources
I1214 12:11:15.550797 25243 slave.cpp:5608] Received oversubscribable resources {} from the resource estimator
I1214 12:11:15.552394 25233 process.cpp:3679] Handling HTTP event for process 'slave(669)' with path: '/slave(669)/monitor/statistics'
I1214 12:11:15.552819 25233 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
I1214 12:11:15.553935 25230 slave.cpp:796] Agent terminating
I1214 12:11:15.564849 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1214 12:11:15.565331 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1214 12:11:15.565435 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 12:11:15.567731 25242 slave.cpp:209] Mesos agent started on (670)@172.17.0.3:57378
I1214 12:11:15.567770 25242 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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_AMQgE9/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_AMQgE9/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_AMQgE9/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_AMQgE9" --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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_rMJxEr"
I1214 12:11:15.568111 25242 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_AMQgE9/credential'
I1214 12:11:15.568248 25242 slave.cpp:352] Agent using credential for: test-principal
I1214 12:11:15.568262 25242 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_AMQgE9/http_credentials'
I1214 12:11:15.568367 25242 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 12:11:15.568426 25242 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1214 12:11:15.568795 25242 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1214 12:11:15.568934 25242 slave.cpp:547] Agent attributes: [ ]
I1214 12:11:15.569003 25242 slave.cpp:552] Agent hostname: 980181492b15
I1214 12:11:15.569517 25231 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_rMJxEr/meta'
I1214 12:11:15.569692 25231 status_update_manager.cpp:203] Recovering status update manager
I1214 12:11:15.569764 25231 containerizer.cpp:594] Recovering containerizer
I1214 12:11:15.570355 25231 provisioner.cpp:253] Provisioner recovery complete
I1214 12:11:15.570513 25231 slave.cpp:5420] Finished recovery
I1214 12:11:15.571229 25231 slave.cpp:5594] Querying resource estimator for oversubscribable resources
I1214 12:11:15.571367 25231 slave.cpp:5608] Received oversubscribable resources {} from the resource estimator
I1214 12:11:15.572696 25235 process.cpp:3679] Handling HTTP event for process 'slave(670)' with path: '/slave(670)/monitor/statistics.json'
I1214 12:11:15.573101 25235 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I1214 12:11:15.573987 25230 slave.cpp:796] Agent terminating
I1214 12:11:15.589037 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1214 12:11:15.589467 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1214 12:11:15.589558 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 12:11:15.591328 25244 slave.cpp:209] Mesos agent started on (671)@172.17.0.3:57378
I1214 12:11:15.591537 25244 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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_wCyaQZ/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_wCyaQZ/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_wCyaQZ/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_wCyaQZ" --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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_6wutMh"
I1214 12:11:15.592346 25244 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_wCyaQZ/credential'
I1214 12:11:15.592589 25244 slave.cpp:352] Agent using credential for: test-principal
I1214 12:11:15.592761 25244 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_wCyaQZ/http_credentials'
I1214 12:11:15.592975 25244 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 12:11:15.593129 25244 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1214 12:11:15.593734 25244 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1214 12:11:15.593914 25244 slave.cpp:547] Agent attributes: [ ]
I1214 12:11:15.594018 25244 slave.cpp:552] Agent hostname: 980181492b15
I1214 12:11:15.594745 25240 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_6wutMh/meta'
I1214 12:11:15.595027 25240 status_update_manager.cpp:203] Recovering status update manager
I1214 12:11:15.595208 25240 containerizer.cpp:594] Recovering containerizer
I1214 12:11:15.595937 25240 provisioner.cpp:253] Provisioner recovery complete
I1214 12:11:15.596230 25239 slave.cpp:5420] Finished recovery
I1214 12:11:15.596833 25239 slave.cpp:5594] Querying resource estimator for oversubscribable resources
I1214 12:11:15.597030 25231 slave.cpp:5608] Received oversubscribable resources {} from the resource estimator
I1214 12:11:15.597949 25246 process.cpp:3679] Handling HTTP event for process 'slave(671)' with path: '/slave(671)/containers'
I1214 12:11:15.598338 25246 http.cpp:874] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I1214 12:11:15.599309 25239 slave.cpp:796] Agent terminating
I1214 12:11:15.629029 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1214 12:11:15.629570 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1214 12:11:15.629757 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 12:11:15.630743 25230 cluster.cpp:446] Creating default 'local' authorizer
I1214 12:11:15.631675 25234 slave.cpp:209] Mesos agent started on (672)@172.17.0.3:57378
I1214 12:11:15.631706 25234 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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_mx9CpQ/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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_mx9CpQ/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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_mx9CpQ/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_mx9CpQ" --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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_ICdtf8"
I1214 12:11:15.632122 25234 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_mx9CpQ/credential'
I1214 12:11:15.632241 25234 slave.cpp:352] Agent using credential for: test-principal
I1214 12:11:15.632252 25234 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_mx9CpQ/http_credentials'
I1214 12:11:15.632374 25234 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 12:11:15.632431 25234 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1214 12:11:15.632830 25234 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1214 12:11:15.632872 25234 slave.cpp:547] Agent attributes: [ ]
I1214 12:11:15.632880 25234 slave.cpp:552] Agent hostname: 980181492b15
I1214 12:11:15.633828 25241 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_ICdtf8/meta'
I1214 12:11:15.634013 25238 status_update_manager.cpp:203] Recovering status update manager
I1214 12:11:15.634145 25241 containerizer.cpp:594] Recovering containerizer
I1214 12:11:15.634677 25241 provisioner.cpp:253] Provisioner recovery complete
I1214 12:11:15.634816 25241 slave.cpp:5420] Finished recovery
I1214 12:11:15.635241 25241 slave.cpp:5594] Querying resource estimator for oversubscribable resources
I1214 12:11:15.635426 25241 slave.cpp:5608] Received oversubscribable resources {} from the resource estimator
I1214 12:11:15.636543 25243 process.cpp:3679] Handling HTTP event for process 'slave(672)' with path: '/slave(672)/monitor/statistics'
I1214 12:11:15.636993 25243 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
I1214 12:11:15.638494 25241 slave.cpp:796] Agent terminating
I1214 12:11:15.644520 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1214 12:11:15.644906 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1214 12:11:15.644992 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 12:11:15.645910 25230 cluster.cpp:446] Creating default 'local' authorizer
I1214 12:11:15.646608 25243 slave.cpp:209] Mesos agent started on (673)@172.17.0.3:57378
I1214 12:11:15.646728 25243 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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_yCq2cH/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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_yCq2cH/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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_yCq2cH/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_yCq2cH" --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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_MjWj0Y"
I1214 12:11:15.647253 25243 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_yCq2cH/credential'
I1214 12:11:15.647490 25243 slave.cpp:352] Agent using credential for: test-principal
I1214 12:11:15.647598 25243 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_yCq2cH/http_credentials'
I1214 12:11:15.647814 25243 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 12:11:15.647969 25243 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1214 12:11:15.648509 25243 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1214 12:11:15.648680 25243 slave.cpp:547] Agent attributes: [ ]
I1214 12:11:15.648788 25243 slave.cpp:552] Agent hostname: 980181492b15
I1214 12:11:15.649363 25243 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_MjWj0Y/meta'
I1214 12:11:15.649641 25234 status_update_manager.cpp:203] Recovering status update manager
I1214 12:11:15.649842 25234 containerizer.cpp:594] Recovering containerizer
I1214 12:11:15.650620 25246 provisioner.cpp:253] Provisioner recovery complete
I1214 12:11:15.650866 25236 slave.cpp:5420] Finished recovery
I1214 12:11:15.651518 25236 slave.cpp:5594] Querying resource estimator for oversubscribable resources
I1214 12:11:15.651758 25235 slave.cpp:5608] Received oversubscribable resources {} from the resource estimator
I1214 12:11:15.652655 25232 process.cpp:3679] Handling HTTP event for process 'slave(673)' with path: '/slave(673)/monitor/statistics.json'
I1214 12:11:15.653105 25232 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I1214 12:11:15.663704 25230 slave.cpp:796] Agent terminating
I1214 12:11:15.670943 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1214 12:11:15.671360 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1214 12:11:15.671519 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 12:11:15.672503 25230 cluster.cpp:446] Creating default 'local' authorizer
I1214 12:11:15.673775 25232 slave.cpp:209] Mesos agent started on (674)@172.17.0.3:57378
I1214 12:11:15.673809 25232 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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_xAZUfy/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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_xAZUfy/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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_xAZUfy/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_xAZUfy" --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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_r0NUYP"
I1214 12:11:15.674207 25232 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_xAZUfy/credential'
I1214 12:11:15.674340 25232 slave.cpp:352] Agent using credential for: test-principal
I1214 12:11:15.674358 25232 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_xAZUfy/http_credentials'
I1214 12:11:15.674484 25232 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 12:11:15.674542 25232 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1214 12:11:15.674962 25232 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1214 12:11:15.675011 25232 slave.cpp:547] Agent attributes: [ ]
I1214 12:11:15.675020 25232 slave.cpp:552] Agent hostname: 980181492b15
I1214 12:11:15.675575 25240 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_r0NUYP/meta'
I1214 12:11:15.675992 25232 status_update_manager.cpp:203] Recovering status update manager
I1214 12:11:15.676070 25232 containerizer.cpp:594] Recovering containerizer
I1214 12:11:15.676558 25233 provisioner.cpp:253] Provisioner recovery complete
I1214 12:11:15.676818 25233 slave.cpp:5420] Finished recovery
I1214 12:11:15.677364 25233 slave.cpp:5594] Querying resource estimator for oversubscribable resources
I1214 12:11:15.677579 25233 slave.cpp:5608] Received oversubscribable resources {} from the resource estimator
I1214 12:11:15.678555 25245 process.cpp:3679] Handling HTTP event for process 'slave(674)' with path: '/slave(674)/containers'
I1214 12:11:15.678997 25245 http.cpp:874] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I1214 12:11:15.680593 25240 slave.cpp:796] Agent terminating
make[3]: *** [CMakeFiles/check] Error 1
make[2]: *** [CMakeFiles/check.dir/all] Error 2
make[1]: *** [CMakeFiles/check.dir/rule] Error 2
make: *** [check] Error 2
+ docker rmi mesos-1481715016-23836
Untagged: mesos-1481715016-23836:latest
Deleted: sha256:35b5606589ad38e969010522263cd1e7671def5a21f38ec0f5e62a0712fb7150
Deleted: sha256:0827e6a41894d10b0acd917034aea16eeb9e195d26f6d83a4694b16a25f76491
Deleted: sha256:ee99d19e5fb56bc088eeb5a59fe903517953bf912c6638bc9048671dc7c9c6e0
Deleted: sha256:727bb7403d861cec175c8a7c628dd54b7fecfd7c6ee0e717460f24c1291d286d
Deleted: sha256:5e3c0adbff616be7b05f5ecceebf6593c769913776300509a153099ebf2e1afc
Deleted: sha256:0422556ad8011539900683bfd7b5810d86f5ed2750624037ff7c3f9ea0af772c
Deleted: sha256:d76551f95ebe1652233dc50e807c890e7aad434be0167feef9c1fcb57aa1ace1
Deleted: sha256:387b77d2b297a323e66833d87ffe1d8f3619d2b4e0eded9f07b1f2b93b194ca6
Deleted: sha256:4218eb4f3e5c918631e3207c3c7a42590d5d91a461e523abcd689d83c1fa8aee
Deleted: sha256:85a1e25f0c901bd8034ca6e097276e60f216ec8ecf3afeb994f9edd2e9e02797
Deleted: sha256:18f6905d7ccb96008315eab7a63f1bc25329fab9bdcdb5308fb336db1fee10d1
Deleted: sha256:9dade16dcdb52669daa277a28c79ccc6b85fa1d96a6ab9558fa741e2c861d7ca
Deleted: sha256:d2b1abdd3369d54aab5d1616e0168b0ac73c2dc90678b22b9cf297637f092b85
Deleted: sha256:f6d56afdb711fef75dc11174b3068d14a65012234c85bc3b9df608fdfc877303
Deleted: sha256:9add5789120a40407b54266eac27fbe9b79d2f2935a4f88c521fcee983f70560
Deleted: sha256:03fa9d105136cec5c5afeabc5c9ad10e75436a3df35ce779ccdf9537e8f3bc38
Deleted: sha256:3a719b33cdef63333f580c2206700d865f94b46fd8ec379ede780673d2d25d08
Deleted: sha256:7a49f7d5072e03b2e751536d5c8878e1c2ee724989ff45fce572dccae3684fe6
Deleted: sha256:55e4cc6a4adb1056a04f14bba5e3206102dc1876ff3a2cfb2b2f00cac21484ae
Deleted: sha256:7131523c368e65e284fe7e97892b2ccb3f2035af846558fe4ed3976763cd7a81
Deleted: sha256:9f0d0d753909b407537156fa9ad905063c5ecc07fcc2541987dc5d0e9ef63734
Deleted: sha256:06d5a6510b88ae2ae8f54fb50a3b5ddf209591b9146a196f17b11d0d79e46dd8
Deleted: sha256:1ea71c358ba47df1ba6b1666e652ab096b09e43553db5bf3d69d9ee11b62ddcf
Deleted: sha256:269d6bcc4464008e602d36ef3a650957670e7deb19598d64159fe59096017619
Build step 'Execute shell' marked build as failure
Jenkins build is back to normal : Mesos » cmake,clang,--verbose --enable-libevent --enable-ssl,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2) #3072
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Mesos/BUILDTOOL=cmake,COMPILER=clang,CONFIGURATION=--verbose%20--enable-libevent%20--enable-ssl,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2)/3072/changes>
Build failed in Jenkins: Mesos » cmake,clang,--verbose --enable-libevent --enable-ssl,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2) #3041
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Mesos/BUILDTOOL=cmake,COMPILER=clang,CONFIGURATION=--verbose%20--enable-libevent%20--enable-ssl,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2)/3041/changes>
Changes:
[josephwu] Stout: Added helper for determining a runtime directory.
[josephwu] Used `os::var()` for the default value in agent `--runtime_dir`.
[josephwu] Windows: Implemented `os::user()'.
[josephwu] Windows: Added trivially passable tests to build.
[josephwu] Windows: Enabled about 500 passing tests on Agent builds.
[benjamin.hindman] Avoided capturing `this` in `process::loop`.
[anand] Fixed the 'IOSwitchboardTest.KillSwitchboardContainerDestroyed' test.
[vinodkone] Added a test that verifies container attach after agent restart.
[vinodkone] Refactored IOSwitchboardServerTest.AttachOutput test.
[vinodkone] Added a fixed-capacity hashmap to stout.
[vinodkone] Updated master to use BoundedHashMap.
[vinodkone] Updated agent to use BoundedHashMap.
[vinodkone] Synchronized v1 and unversioned master.proto.
[vinodkone] Improved various comments.
------------------------------------------
[...truncated 154403 lines...]
I1216 20:36:03.051970 25236 master.cpp:2997] Deactivating agent c39465c0-bf10-4d37-91be-5f4471a49893-S0 at slave(574)@172.17.0.3:36782 (dff2089d3e7a)
I1216 20:36:03.052039 25233 hierarchical.cpp:589] Agent c39465c0-bf10-4d37-91be-5f4471a49893-S0 deactivated
I1216 20:36:03.054095 25230 master.cpp:1097] Master terminating
I1216 20:36:03.054298 25243 hierarchical.cpp:522] Removed agent c39465c0-bf10-4d37-91be-5f4471a49893-S0
[ OK ] ContentType/AgentAPITest.LaunchNestedContainerSessionWithTTY/0 (417 ms)
[ RUN ] ContentType/AgentAPITest.LaunchNestedContainerSessionWithTTY/1
I1216 20:36:03.058158 25230 cluster.cpp:160] Creating default 'local' authorizer
I1216 20:36:03.059257 25239 master.cpp:380] Master 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e (dff2089d3e7a) started on 172.17.0.3:36782
I1216 20:36:03.059285 25239 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/PSwIts/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="/usr/local/share/mesos/webui" --work_dir="/tmp/PSwIts/master" --zk_session_timeout="10secs"
I1216 20:36:03.059479 25239 master.cpp:432] Master only allowing authenticated frameworks to register
I1216 20:36:03.059494 25239 master.cpp:446] Master only allowing authenticated agents to register
I1216 20:36:03.059499 25239 master.cpp:459] Master only allowing authenticated HTTP frameworks to register
I1216 20:36:03.059505 25239 credentials.hpp:37] Loading credentials for authentication from '/tmp/PSwIts/credentials'
I1216 20:36:03.059653 25239 master.cpp:504] Using default 'crammd5' authenticator
I1216 20:36:03.059710 25239 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-readonly'
I1216 20:36:03.059759 25239 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-readwrite'
I1216 20:36:03.059801 25239 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-scheduler'
I1216 20:36:03.059834 25239 master.cpp:584] Authorization enabled
I1216 20:36:03.060513 25239 hierarchical.cpp:149] Initialized hierarchical allocator process
I1216 20:36:03.060539 25239 whitelist_watcher.cpp:77] No whitelist given
I1216 20:36:03.061064 25239 master.cpp:2046] Elected as the leading master!
I1216 20:36:03.061079 25239 master.cpp:1568] Recovering from registrar
I1216 20:36:03.061142 25239 registrar.cpp:329] Recovering registrar
I1216 20:36:03.061360 25239 registrar.cpp:362] Successfully fetched the registry (0B) in 199936ns
I1216 20:36:03.061398 25239 registrar.cpp:461] Applied 1 operations in 11835ns; attempting to update the registry
I1216 20:36:03.061661 25239 registrar.cpp:506] Successfully updated the registry in 239872ns
I1216 20:36:03.061712 25239 registrar.cpp:392] Successfully recovered registrar
I1216 20:36:03.061846 25239 master.cpp:1684] Recovered 0 agents from the registry (129B); allowing 10mins for agents to re-register
I1216 20:36:03.061909 25239 hierarchical.cpp:176] Skipping recovery of hierarchical allocator: nothing to recover
I1216 20:36:03.063134 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1216 20:36:03.063490 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1216 20:36:03.063582 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1216 20:36:03.065212 25230 cluster.cpp:446] Creating default 'local' authorizer
I1216 20:36:03.065901 25231 slave.cpp:209] Mesos agent started on (575)@172.17.0.3:36782
I1216 20:36:03.065929 25231 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/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_9iylBI/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/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_9iylBI/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/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_9iylBI/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_9iylBI" --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/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA"
I1216 20:36:03.066354 25231 credentials.hpp:86] Loading credential for authentication from '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_9iylBI/credential'
I1216 20:36:03.066473 25231 slave.cpp:352] Agent using credential for: test-principal
I1216 20:36:03.066495 25230 sched.cpp:232] Version: 1.2.0
I1216 20:36:03.066591 25231 credentials.hpp:37] Loading credentials for authentication from '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_9iylBI/http_credentials'
I1216 20:36:03.066757 25231 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1216 20:36:03.066802 25235 sched.cpp:336] New master detected at master@172.17.0.3:36782
I1216 20:36:03.066807 25231 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1216 20:36:03.066848 25235 sched.cpp:402] Authenticating with master master@172.17.0.3:36782
I1216 20:36:03.066859 25235 sched.cpp:409] Using default CRAM-MD5 authenticatee
I1216 20:36:03.066982 25245 authenticatee.cpp:121] Creating new client SASL connection
I1216 20:36:03.067239 25237 master.cpp:6751] Authenticating scheduler-a130998e-0a31-4a6b-96e6-75eda3a16218@172.17.0.3:36782
I1216 20:36:03.067342 25234 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(1126)@172.17.0.3:36782
I1216 20:36:03.067399 25231 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 20:36:03.067448 25231 slave.cpp:547] Agent attributes: [ ]
I1216 20:36:03.067461 25231 slave.cpp:552] Agent hostname: dff2089d3e7a
I1216 20:36:03.067495 25237 authenticator.cpp:98] Creating new server SASL connection
I1216 20:36:03.067654 25234 authenticatee.cpp:213] Received SASL authentication mechanisms: CRAM-MD5
I1216 20:36:03.067677 25234 authenticatee.cpp:239] Attempting to authenticate with mechanism 'CRAM-MD5'
I1216 20:36:03.067821 25234 authenticator.cpp:204] Received SASL authentication start
I1216 20:36:03.067901 25234 authenticator.cpp:326] Authentication requires more steps
I1216 20:36:03.067939 25231 state.cpp:57] Recovering state from '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/meta'
I1216 20:36:03.068119 25234 authenticatee.cpp:259] Received SASL authentication step
I1216 20:36:03.068478 25235 status_update_manager.cpp:203] Recovering status update manager
I1216 20:36:03.068491 25234 authenticator.cpp:232] Received SASL authentication step
I1216 20:36:03.068512 25234 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'dff2089d3e7a' server FQDN: 'dff2089d3e7a' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false
I1216 20:36:03.068550 25234 auxprop.cpp:181] Looking up auxiliary property '*userPassword'
I1216 20:36:03.068583 25236 containerizer.cpp:594] Recovering containerizer
I1216 20:36:03.068591 25234 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5'
I1216 20:36:03.068900 25234 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'dff2089d3e7a' server FQDN: 'dff2089d3e7a' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true
I1216 20:36:03.068917 25234 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since SASL_AUXPROP_AUTHZID == true
I1216 20:36:03.068924 25234 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5' since SASL_AUXPROP_AUTHZID == true
I1216 20:36:03.068941 25234 authenticator.cpp:318] Authentication success
I1216 20:36:03.069013 25234 master.cpp:6781] Successfully authenticated principal 'test-principal' at scheduler-a130998e-0a31-4a6b-96e6-75eda3a16218@172.17.0.3:36782
I1216 20:36:03.069120 25241 authenticatee.cpp:299] Authentication success
I1216 20:36:03.069191 25241 sched.cpp:508] Successfully authenticated with master master@172.17.0.3:36782
I1216 20:36:03.069205 25241 sched.cpp:826] Sending SUBSCRIBE call to master@172.17.0.3:36782
I1216 20:36:03.069247 25241 sched.cpp:859] Will retry registration in 63.694153ms if necessary
I1216 20:36:03.069303 25242 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(1126)@172.17.0.3:36782
I1216 20:36:03.069586 25241 master.cpp:2634] Received SUBSCRIBE call for framework 'default' at scheduler-a130998e-0a31-4a6b-96e6-75eda3a16218@172.17.0.3:36782
I1216 20:36:03.069603 25241 master.cpp:2082] Authorizing framework principal 'test-principal' to receive offers for role '*'
I1216 20:36:03.069809 25233 provisioner.cpp:253] Provisioner recovery complete
I1216 20:36:03.069811 25241 master.cpp:2710] Subscribing framework default with checkpointing disabled and capabilities [ ]
I1216 20:36:03.069969 25232 slave.cpp:5407] Finished recovery
I1216 20:36:03.070021 25242 hierarchical.cpp:276] Added framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.070045 25242 hierarchical.cpp:1689] No allocations performed
I1216 20:36:03.070053 25242 hierarchical.cpp:1784] No inverse offers to send out!
I1216 20:36:03.070065 25242 hierarchical.cpp:1291] Performed allocation for 0 agents in 31436ns
I1216 20:36:03.070106 25241 sched.cpp:749] Framework registered with 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.070140 25241 sched.cpp:763] Scheduler::registered took 21919ns
I1216 20:36:03.070423 25232 slave.cpp:5581] Querying resource estimator for oversubscribable resources
I1216 20:36:03.070540 25232 slave.cpp:924] New master detected at master@172.17.0.3:36782
I1216 20:36:03.070550 25241 status_update_manager.cpp:177] Pausing sending status updates
I1216 20:36:03.070560 25232 slave.cpp:983] Authenticating with master master@172.17.0.3:36782
I1216 20:36:03.070582 25232 slave.cpp:994] Using default CRAM-MD5 authenticatee
I1216 20:36:03.070639 25232 slave.cpp:956] Detecting new master
I1216 20:36:03.070760 25244 authenticatee.cpp:121] Creating new client SASL connection
I1216 20:36:03.070883 25234 slave.cpp:5595] Received oversubscribable resources {} from the resource estimator
I1216 20:36:03.070960 25234 master.cpp:6751] Authenticating slave(575)@172.17.0.3:36782
I1216 20:36:03.071022 25234 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(1127)@172.17.0.3:36782
I1216 20:36:03.071100 25234 authenticator.cpp:98] Creating new server SASL connection
I1216 20:36:03.071223 25234 authenticatee.cpp:213] Received SASL authentication mechanisms: CRAM-MD5
I1216 20:36:03.071251 25234 authenticatee.cpp:239] Attempting to authenticate with mechanism 'CRAM-MD5'
I1216 20:36:03.071293 25234 authenticator.cpp:204] Received SASL authentication start
I1216 20:36:03.071338 25234 authenticator.cpp:326] Authentication requires more steps
I1216 20:36:03.071382 25234 authenticatee.cpp:259] Received SASL authentication step
I1216 20:36:03.071436 25234 authenticator.cpp:232] Received SASL authentication step
I1216 20:36:03.071462 25234 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'dff2089d3e7a' server FQDN: 'dff2089d3e7a' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false
I1216 20:36:03.071472 25234 auxprop.cpp:181] Looking up auxiliary property '*userPassword'
I1216 20:36:03.071485 25234 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5'
I1216 20:36:03.071504 25234 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'dff2089d3e7a' server FQDN: 'dff2089d3e7a' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true
I1216 20:36:03.071514 25234 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since SASL_AUXPROP_AUTHZID == true
I1216 20:36:03.071521 25234 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5' since SASL_AUXPROP_AUTHZID == true
I1216 20:36:03.071535 25234 authenticator.cpp:318] Authentication success
I1216 20:36:03.071580 25234 authenticatee.cpp:299] Authentication success
I1216 20:36:03.071614 25234 master.cpp:6781] Successfully authenticated principal 'test-principal' at slave(575)@172.17.0.3:36782
I1216 20:36:03.071652 25234 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(1127)@172.17.0.3:36782
I1216 20:36:03.071732 25234 slave.cpp:1078] Successfully authenticated with master master@172.17.0.3:36782
I1216 20:36:03.071792 25234 slave.cpp:1493] Will retry registration in 14.791356ms if necessary
I1216 20:36:03.071925 25234 master.cpp:5162] Registering agent at slave(575)@172.17.0.3:36782 (dff2089d3e7a) with id 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0
I1216 20:36:03.072087 25234 registrar.cpp:461] Applied 1 operations in 25604ns; attempting to update the registry
I1216 20:36:03.072556 25234 registrar.cpp:506] Successfully updated the registry in 435968ns
I1216 20:36:03.072815 25234 master.cpp:5233] Registered agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 at slave(575)@172.17.0.3:36782 (dff2089d3e7a) with cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 20:36:03.072974 25234 hierarchical.cpp:490] Added agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 (dff2089d3e7a) with cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] (allocated: {})
I1216 20:36:03.073235 25234 hierarchical.cpp:1784] No inverse offers to send out!
I1216 20:36:03.073266 25234 hierarchical.cpp:1314] Performed allocation for agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 in 266157ns
I1216 20:36:03.073313 25234 slave.cpp:1124] Registered with master master@172.17.0.3:36782; given agent ID 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0
I1216 20:36:03.073333 25234 fetcher.cpp:90] Clearing fetcher cache
I1216 20:36:03.073648 25234 slave.cpp:1147] Checkpointing SlaveInfo to '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/meta/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/slave.info'
I1216 20:36:03.073932 25234 slave.cpp:1184] Forwarding total oversubscribed resources {}
I1216 20:36:03.073982 25234 slave.cpp:4263] Received ping from slave-observer(529)@172.17.0.3:36782
I1216 20:36:03.074152 25234 master.cpp:6580] Sending 1 offers to framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 (default) at scheduler-a130998e-0a31-4a6b-96e6-75eda3a16218@172.17.0.3:36782
I1216 20:36:03.074229 25234 master.cpp:5636] Received update of agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 at slave(575)@172.17.0.3:36782 (dff2089d3e7a) with total oversubscribed resources {}
I1216 20:36:03.074306 25234 status_update_manager.cpp:184] Resuming sending status updates
I1216 20:36:03.074452 25234 sched.cpp:923] Scheduler::resourceOffers took 49255ns
I1216 20:36:03.074517 25234 hierarchical.cpp:560] Agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 (dff2089d3e7a) updated with oversubscribed resources {} (total: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000], allocated: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000])
I1216 20:36:03.074579 25234 hierarchical.cpp:1689] No allocations performed
I1216 20:36:03.074594 25234 hierarchical.cpp:1784] No inverse offers to send out!
I1216 20:36:03.074612 25234 hierarchical.cpp:1314] Performed allocation for agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 in 63796ns
I1216 20:36:03.075489 25246 master.cpp:3589] Processing ACCEPT call for offers: [ 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-O0 ] on agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 at slave(575)@172.17.0.3:36782 (dff2089d3e7a) for framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 (default) at scheduler-a130998e-0a31-4a6b-96e6-75eda3a16218@172.17.0.3:36782
I1216 20:36:03.075537 25246 master.cpp:3176] Authorizing framework principal 'test-principal' to launch task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d
I1216 20:36:03.076192 25239 master.cpp:8499] Adding task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d with resources cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] on agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 (dff2089d3e7a)
I1216 20:36:03.076386 25239 master.cpp:4241] Launching task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 (default) at scheduler-a130998e-0a31-4a6b-96e6-75eda3a16218@172.17.0.3:36782 with resources cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] on agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 at slave(575)@172.17.0.3:36782 (dff2089d3e7a)
I1216 20:36:03.076733 25232 slave.cpp:1557] Got assigned task '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' for framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.077059 25232 slave.cpp:1717] Launching task '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' for framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.077575 25232 paths.cpp:530] Trying to chown '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/frameworks/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000/executors/9f70fbe0-2bfb-4864-ae7e-28a73d19482d/runs/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32' to user 'mesos'
I1216 20:36:03.085901 25232 slave.cpp:6334] Launching executor '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 with resources cpus(*):0.1; mem(*):32 in work directory '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/frameworks/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000/executors/9f70fbe0-2bfb-4864-ae7e-28a73d19482d/runs/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32'
I1216 20:36:03.086369 25238 containerizer.cpp:986] Starting container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32 for executor '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.086374 25232 slave.cpp:2039] Queued task '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' for executor '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.086453 25232 slave.cpp:877] Successfully attached file '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/frameworks/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000/executors/9f70fbe0-2bfb-4864-ae7e-28a73d19482d/runs/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32'
I1216 20:36:03.088156 25235 containerizer.cpp:1535] Launching 'mesos-containerizer' with flags '--help="false" --launch_info="{"command":{"arguments":["mesos-executor","--launcher_dir=\/mesos\/build\/src"],"shell":false,"value":"\/mesos\/build\/src\/mesos-executor"},"environment":{"variables":[{"name":"LIBPROCESS_PORT","value":"0"},{"name":"MESOS_AGENT_ENDPOINT","value":"172.17.0.3:36782"},{"name":"MESOS_CHECKPOINT","value":"0"},{"name":"MESOS_DIRECTORY","value":"\/tmp\/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA\/slaves\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0\/frameworks\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000\/executors\/9f70fbe0-2bfb-4864-ae7e-28a73d19482d\/runs\/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32"},{"name":"MESOS_EXECUTOR_ID","value":"9f70fbe0-2bfb-4864-ae7e-28a73d19482d"},{"name":"MESOS_EXECUTOR_SHUTDOWN_GRACE_PERIOD","value":"5secs"},{"name":"MESOS_FRAMEWORK_ID","value":"3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000"},{"name":"MESOS_HTTP_COMMAND_EXECUTOR","value":"0"},{"name":"MESOS_SLAVE_ID","value":"3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0"},{"name":"MESOS_SLAVE_PID","value":"slave(575)@172.17.0.3:36782"},{"name":"MESOS_SANDBOX","value":"\/tmp\/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA\/slaves\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0\/frameworks\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000\/executors\/9f70fbe0-2bfb-4864-ae7e-28a73d19482d\/runs\/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32"}]},"err":{"path":"\/tmp\/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA\/slaves\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0\/frameworks\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000\/executors\/9f70fbe0-2bfb-4864-ae7e-28a73d19482d\/runs\/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32\/stderr","type":"PATH"},"out":{"path":"\/tmp\/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA\/slaves\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0\/frameworks\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000\/executors\/9f70fbe0-2bfb-4864-ae7e-28a73d19482d\/runs\/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32\/stdout","type":"PATH"},"user":"mesos","working_directory":"\/tmp\/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA\/slaves\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0\/frameworks\/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000\/executors\/9f70fbe0-2bfb-4864-ae7e-28a73d19482d\/runs\/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32"}" --pipe_read="9" --pipe_write="13" --runtime_directory="/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_9iylBI/containers/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32" --unshare_namespace_mnt="false"'
I1216 20:36:03.090517 25235 launcher.cpp:133] Forked child with pid '29896' for container 'ea4a4010-0b50-4c59-a61f-b32d3f3f4c32'
I1216 20:36:03.092506 25232 fetcher.cpp:349] Starting to fetch URIs for container: ea4a4010-0b50-4c59-a61f-b32d3f3f4c32, directory: /tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/frameworks/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000/executors/9f70fbe0-2bfb-4864-ae7e-28a73d19482d/runs/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32
I1216 20:36:03.206832 25232 slave.cpp:3308] Got registration for executor '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 from executor(1)@172.17.0.3:51352
I1216 20:36:03.207646 25244 slave.cpp:2253] Sending queued task '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' to executor '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 at executor(1)@172.17.0.3:51352
I1216 20:36:03.212126 25241 slave.cpp:3740] Handling status update TASK_RUNNING (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 from executor(1)@172.17.0.3:51352
I1216 20:36:03.212719 25246 status_update_manager.cpp:323] Received status update TASK_RUNNING (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.212743 25246 status_update_manager.cpp:500] Creating StatusUpdate stream for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.212910 25246 status_update_manager.cpp:377] Forwarding update TASK_RUNNING (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 to the agent
I1216 20:36:03.213035 25236 slave.cpp:4181] Forwarding the update TASK_RUNNING (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 to master@172.17.0.3:36782
I1216 20:36:03.213155 25236 slave.cpp:4075] Status update manager successfully handled status update TASK_RUNNING (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.213176 25236 slave.cpp:4091] Sending acknowledgement for status update TASK_RUNNING (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 to executor(1)@172.17.0.3:51352
I1216 20:36:03.213248 25233 master.cpp:5772] Status update TASK_RUNNING (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 from agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 at slave(575)@172.17.0.3:36782 (dff2089d3e7a)
I1216 20:36:03.213279 25233 master.cpp:5834] Forwarding status update TASK_RUNNING (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.213348 25233 master.cpp:7871] Updating the state of task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 (latest state: TASK_RUNNING, status update state: TASK_RUNNING)
I1216 20:36:03.213486 25235 sched.cpp:1031] Scheduler::statusUpdate took 85362ns
I1216 20:36:03.213671 25243 master.cpp:4878] Processing ACKNOWLEDGE call 02647b2c-f9c0-4c44-9f3c-63305b157eb8 for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 (default) at scheduler-a130998e-0a31-4a6b-96e6-75eda3a16218@172.17.0.3:36782 on agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0
I1216 20:36:03.213814 25236 status_update_manager.cpp:395] Received status update acknowledgement (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.213963 25234 slave.cpp:3028] Status update manager successfully handled status update acknowledgement (UUID: 02647b2c-f9c0-4c44-9f3c-63305b157eb8) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.215064 25234 process.cpp:3679] Handling HTTP event for process 'slave(575)' with path: '/slave(575)/api/v1'
I1216 20:36:03.215410 25246 http.cpp:301] HTTP POST for /slave(575)/api/v1 from 172.17.0.3:54928
I1216 20:36:03.215625 25246 http.cpp:462] Processing call LAUNCH_NESTED_CONTAINER_SESSION
I1216 20:36:03.215829 25245 containerizer.cpp:1802] Starting nested container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794
I1216 20:36:03.216059 25245 containerizer.cpp:1826] Trying to chown '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/frameworks/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000/executors/9f70fbe0-2bfb-4864-ae7e-28a73d19482d/runs/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32/containers/fb109dbb-103d-4417-b10c-dd5ae3e7a794' to user 'mesos'
I1216 20:36:03.221781 25240 switchboard.cpp:430] Allocated pseudo terminal '/dev/pts/1' for container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794
I1216 20:36:03.222002 25240 switchboard.cpp:567] Launching 'mesos-io-switchboard' with flags '--heartbeat_interval="30secs" --help="false" --socket_address="/tmp/mesos-io-switchboard-3941e989-6271-4d52-b5b7-34be969954b2" --stderr_from_fd="18" --stderr_to_fd="2" --stdin_to_fd="18" --stdout_from_fd="18" --stdout_to_fd="1" --tty="true" --wait_for_connection="true"' for container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794
I1216 20:36:03.223428 25240 switchboard.cpp:597] Created I/O switchboard server (pid: 29918) listening on socket file '/tmp/mesos-io-switchboard-3941e989-6271-4d52-b5b7-34be969954b2' for container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794
I1216 20:36:03.224522 25244 containerizer.cpp:1535] Launching 'mesos-containerizer' with flags '--help="false" --launch_info="{"command":{"shell":true,"value":"printf output && printf error 1>&2"},"environment":{},"err":{"fd":19,"type":"FD"},"in":{"fd":19,"type":"FD"},"out":{"fd":19,"type":"FD"},"tty_slave_path":"\/dev\/pts\/1","user":"mesos"}" --pipe_read="18" --pipe_write="20" --runtime_directory="/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_9iylBI/containers/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32/containers/fb109dbb-103d-4417-b10c-dd5ae3e7a794" --unshare_namespace_mnt="false"'
I1216 20:36:03.225744 25244 launcher.cpp:133] Forked child with pid '29919' for container 'ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794'
I1216 20:36:03.227310 25237 fetcher.cpp:349] Starting to fetch URIs for container: ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794, directory: /tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/frameworks/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000/executors/9f70fbe0-2bfb-4864-ae7e-28a73d19482d/runs/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32/containers/fb109dbb-103d-4417-b10c-dd5ae3e7a794
**** DEADLOCK DETECTED! ****
You are waiting on process __limiter__(592)@172.17.0.3:36782 that it is currently executing.
I1216 20:36:03.283390 25246 http.cpp:2706] Received EOF attach response for ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794
W1216 20:36:03.283879 25246 http.cpp:2721] Launch nested container session connection for container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794 closed
I1216 20:36:03.283943 25244 containerizer.cpp:2113] Destroying container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794 in RUNNING state
I1216 20:36:03.284445 25244 launcher.cpp:149] Asked to destroy container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794
I1216 20:36:03.284690 25230 sched.cpp:2008] Asked to stop the driver
I1216 20:36:03.284827 25242 sched.cpp:1193] Stopping framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.285032 25245 master.cpp:7291] Processing TEARDOWN call for framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 (default) at scheduler-a130998e-0a31-4a6b-96e6-75eda3a16218@172.17.0.3:36782
I1216 20:36:03.285284 25245 master.cpp:7303] Removing framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 (default) at scheduler-a130998e-0a31-4a6b-96e6-75eda3a16218@172.17.0.3:36782
I1216 20:36:03.285548 25245 master.cpp:7871] Updating the state of task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 (latest state: TASK_KILLED, status update state: TASK_KILLED)
I1216 20:36:03.286208 25245 master.cpp:7967] Removing task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d with resources cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 on agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 at slave(575)@172.17.0.3:36782 (dff2089d3e7a)
I1216 20:36:03.285912 25237 slave.cpp:2581] Asked to shut down framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 by master@172.17.0.3:36782
I1216 20:36:03.286590 25237 slave.cpp:2606] Shutting down framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.285694 25235 hierarchical.cpp:391] Deactivated framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.287021 25237 slave.cpp:4986] Shutting down executor '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 at executor(1)@172.17.0.3:51352
I1216 20:36:03.287282 25235 hierarchical.cpp:1023] Recovered cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] (total: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000], allocated: {}) on agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 from framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.287708 25235 hierarchical.cpp:342] Removed framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.289949 25236 containerizer.cpp:2113] Destroying container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32 in RUNNING state
I1216 20:36:03.308790 25244 slave.cpp:3740] Handling status update TASK_KILLED (UUID: 29f15088-1606-4c53-81dc-9c6c199f3e96) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 from executor(1)@172.17.0.3:51352
W1216 20:36:03.308917 25244 slave.cpp:3809] Ignoring status update TASK_KILLED (UUID: 29f15088-1606-4c53-81dc-9c6c199f3e96) for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 for terminating framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
E1216 20:36:03.341255 25242 switchboard.cpp:880] Unexpected termination of I/O switchboard server: 'IOSwitchboard' exited with status: 1 for container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794
I1216 20:36:03.341578 25237 containerizer.cpp:2476] Container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794 has exited
I1216 20:36:03.342720 25235 provisioner.cpp:324] Ignoring destroy request for unknown container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794
I1216 20:36:03.342880 25235 containerizer.cpp:2392] Checkpointing termination state to nested container's runtime directory '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_9iylBI/containers/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32/containers/fb109dbb-103d-4417-b10c-dd5ae3e7a794/termination'
I1216 20:36:03.343471 25235 launcher.cpp:149] Asked to destroy container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32
I1216 20:36:03.350227 25235 slave.cpp:4309] Got exited event for executor(1)@172.17.0.3:51352
I1216 20:36:03.445837 25241 containerizer.cpp:2476] Container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32 has exited
I1216 20:36:03.446668 25243 provisioner.cpp:324] Ignoring destroy request for unknown container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32
I1216 20:36:03.447849 25246 slave.cpp:4672] Executor '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 terminated with signal Killed
I1216 20:36:03.447888 25246 slave.cpp:4772] Cleaning up executor '9f70fbe0-2bfb-4864-ae7e-28a73d19482d' of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000 at executor(1)@172.17.0.3:51352
I1216 20:36:03.448279 25233 gc.cpp:55] Scheduling '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/frameworks/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000/executors/9f70fbe0-2bfb-4864-ae7e-28a73d19482d/runs/ea4a4010-0b50-4c59-a61f-b32d3f3f4c32' for gc 6.99999481253333days in the future
I1216 20:36:03.448346 25246 slave.cpp:4860] Cleaning up framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.448355 25233 gc.cpp:55] Scheduling '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/frameworks/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000/executors/9f70fbe0-2bfb-4864-ae7e-28a73d19482d' for gc 6.99999481100741days in the future
W1216 20:36:03.448408 25243 containerizer.cpp:2101] Attempted to destroy unknown container ea4a4010-0b50-4c59-a61f-b32d3f3f4c32.fb109dbb-103d-4417-b10c-dd5ae3e7a794
I1216 20:36:03.448499 25233 status_update_manager.cpp:285] Closing status update streams for framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.448521 25233 status_update_manager.cpp:531] Cleaning up status update stream for task 9f70fbe0-2bfb-4864-ae7e-28a73d19482d of framework 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000
I1216 20:36:03.448572 25245 gc.cpp:55] Scheduling '/tmp/ContentType_AgentAPITest_LaunchNestedContainerSessionWithTTY_1_r6FwxA/slaves/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0/frameworks/3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-0000' for gc 6.99999480874963days in the future
I1216 20:36:03.448801 25238 slave.cpp:796] Agent terminating
I1216 20:36:03.448875 25238 master.cpp:1258] Agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 at slave(575)@172.17.0.3:36782 (dff2089d3e7a) disconnected
I1216 20:36:03.448904 25238 master.cpp:2978] Disconnecting agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 at slave(575)@172.17.0.3:36782 (dff2089d3e7a)
I1216 20:36:03.448927 25238 master.cpp:2997] Deactivating agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 at slave(575)@172.17.0.3:36782 (dff2089d3e7a)
I1216 20:36:03.448993 25244 hierarchical.cpp:589] Agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0 deactivated
I1216 20:36:03.450732 25230 master.cpp:1097] Master terminating
I1216 20:36:03.451014 25233 hierarchical.cpp:522] Removed agent 3081bf96-4723-4b6f-8f48-b1cb7bb9ba8e-S0
[ OK ] ContentType/AgentAPITest.LaunchNestedContainerSessionWithTTY/1 (395 ms)
[ RUN ] ContentType/AgentAPITest.LaunchNestedContainerSessionDisconnected/0
I1216 20:36:03.454838 25230 cluster.cpp:160] Creating default 'local' authorizer
I1216 20:36:03.455631 25243 master.cpp:380] Master 664dcb78-584a-4efc-b5f6-0ef36477f146 (dff2089d3e7a) started on 172.17.0.3:36782
I1216 20:36:03.455662 25243 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/pcmMIW/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="/usr/local/share/mesos/webui" --work_dir="/tmp/pcmMIW/master" --zk_session_timeout="10secs"
I1216 20:36:03.455835 25243 master.cpp:432] Master only allowing authenticated frameworks to register
I1216 20:36:03.455842 25243 master.cpp:446] Master only allowing authenticated agents to register
I1216 20:36:03.455845 25243 master.cpp:459] Master only allowing authenticated HTTP frameworks to register
I1216 20:36:03.455850 25243 credentials.hpp:37] Loading credentials for authentication from '/tmp/pcmMIW/credentials'
I1216 20:36:03.455961 25243 master.cpp:504] Using default 'crammd5' authenticator
I1216 20:36:03.456007 25243 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-readonly'
I1216 20:36:03.456051 25243 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-readwrite'
I1216 20:36:03.456096 25243 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-master-scheduler'
I1216 20:36:03.456148 25243 master.cpp:584] Authorization enabled
I1216 20:36:03.456279 25233 hierarchical.cpp:149] Initialized hierarchical allocator process
I1216 20:36:03.456318 25236 whitelist_watcher.cpp:77] No whitelist given
I1216 20:36:03.457003 25233 master.cpp:2046] Elected as the leading master!
I1216 20:36:03.457015 25233 master.cpp:1568] Recovering from registrar
I1216 20:36:03.457067 25241 registrar.cpp:329] Recovering registrar
I1216 20:36:03.457367 25238 registrar.cpp:362] Successfully fetched the registry (0B) in 276992ns
I1216 20:36:03.457401 25238 registrar.cpp:461] Applied 1 operations in 7494ns; attempting to update the registry
I1216 20:36:03.457697 25239 registrar.cpp:506] Successfully updated the registry in 238080ns
I1216 20:36:03.457738 25239 registrar.cpp:392] Successfully recovered registrar
I1216 20:36:03.457850 25245 master.cpp:1684] Recovered 0 agents from the registry (129B); allowing 10mins for agents to re-register
I1216 20:36:03.457896 25236 hierarchical.cpp:176] Skipping recovery of hierarchical allocator: nothing to recover
Build timed out (after 300 minutes). Marking the build as failed.
Build was aborted
++ docker rmi mesos-1481918142-13125
Error response from daemon: conflict: unable to remove repository reference "mesos-1481918142-13125" (must force) - container dff2089d3e7a is using its referenced image e5e4662322c5
Build failed in Jenkins: Mesos » cmake,clang,--verbose --enable-libevent --enable-ssl,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2) #3040
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Mesos/BUILDTOOL=cmake,COMPILER=clang,CONFIGURATION=--verbose%20--enable-libevent%20--enable-ssl,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2)/3040/changes>
Changes:
[mpark] Specified that we search for the query parameter in the request body.
[josephwu] Fixed builds with HAS_AUTHENTICATION=false.
[josephwu] Windows: Added `recordio_tests.cpp` to test build.
[josephwu] Windows: Added Mesos tests to the build helper.
[josephwu] Windows: Disambiguated `os::write` by adding another overload.
------------------------------------------
[...truncated 167515 lines...]
[ OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/0 (15 ms)
[ RUN ] Endpoint/SlaveEndpointTest.AuthorizedRequest/1
I1216 01:36:24.485561 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1216 01:36:24.485899 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1216 01:36:24.485972 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1216 01:36:24.487208 25241 slave.cpp:209] Mesos agent started on (667)@172.17.0.4:55768
I1216 01:36:24.487293 25241 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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_LG8Lwl/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_LG8Lwl/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_LG8Lwl/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_LG8Lwl" --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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_STHyLK"
I1216 01:36:24.487741 25241 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_LG8Lwl/credential'
I1216 01:36:24.487900 25241 slave.cpp:352] Agent using credential for: test-principal
I1216 01:36:24.487915 25241 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_LG8Lwl/http_credentials'
I1216 01:36:24.488045 25241 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1216 01:36:24.488106 25241 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1216 01:36:24.488521 25241 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 01:36:24.488566 25241 slave.cpp:547] Agent attributes: [ ]
I1216 01:36:24.488576 25241 slave.cpp:552] Agent hostname: 996f3eb2ebf0
I1216 01:36:24.489030 25241 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_STHyLK/meta'
I1216 01:36:24.489194 25233 status_update_manager.cpp:203] Recovering status update manager
I1216 01:36:24.489271 25233 containerizer.cpp:594] Recovering containerizer
I1216 01:36:24.489811 25233 provisioner.cpp:253] Provisioner recovery complete
I1216 01:36:24.489946 25233 slave.cpp:5408] Finished recovery
I1216 01:36:24.490373 25233 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1216 01:36:24.490527 25233 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1216 01:36:24.491500 25246 process.cpp:3679] Handling HTTP event for process 'slave(667)' with path: '/slave(667)/monitor/statistics.json'
I1216 01:36:24.491906 25246 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I1216 01:36:24.492981 25241 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/1 (11 ms)
[ RUN ] Endpoint/SlaveEndpointTest.AuthorizedRequest/2
I1216 01:36:24.497107 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1216 01:36:24.497490 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1216 01:36:24.497668 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1216 01:36:24.499050 25232 slave.cpp:209] Mesos agent started on (668)@172.17.0.4:55768
I1216 01:36:24.499186 25232 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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_nIrbGI/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_nIrbGI/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_nIrbGI/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_nIrbGI" --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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_sYR2S7"
I1216 01:36:24.499630 25232 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_nIrbGI/credential'
I1216 01:36:24.499836 25232 slave.cpp:352] Agent using credential for: test-principal
I1216 01:36:24.499933 25232 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_nIrbGI/http_credentials'
I1216 01:36:24.500079 25232 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1216 01:36:24.500180 25232 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1216 01:36:24.500618 25232 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 01:36:24.500669 25232 slave.cpp:547] Agent attributes: [ ]
I1216 01:36:24.500680 25232 slave.cpp:552] Agent hostname: 996f3eb2ebf0
I1216 01:36:24.501422 25232 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_sYR2S7/meta'
I1216 01:36:24.501583 25232 status_update_manager.cpp:203] Recovering status update manager
I1216 01:36:24.501646 25232 containerizer.cpp:594] Recovering containerizer
I1216 01:36:24.502248 25232 provisioner.cpp:253] Provisioner recovery complete
I1216 01:36:24.502405 25232 slave.cpp:5408] Finished recovery
I1216 01:36:24.502851 25232 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1216 01:36:24.503017 25233 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1216 01:36:24.503821 25238 process.cpp:3679] Handling HTTP event for process 'slave(668)' with path: '/slave(668)/containers'
I1216 01:36:24.504190 25238 http.cpp:874] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I1216 01:36:24.505604 25240 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/2 (14 ms)
[ RUN ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/0
I1216 01:36:24.511046 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1216 01:36:24.511437 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1216 01:36:24.511538 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1216 01:36:24.513514 25239 slave.cpp:209] Mesos agent started on (669)@172.17.0.4:55768
I1216 01:36:24.513793 25239 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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_EoBlY5/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_EoBlY5/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_EoBlY5/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_EoBlY5" --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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_1QIX8u"
I1216 01:36:24.514058 25239 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_EoBlY5/credential'
I1216 01:36:24.514204 25239 slave.cpp:352] Agent using credential for: test-principal
I1216 01:36:24.514238 25239 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_EoBlY5/http_credentials'
I1216 01:36:24.514384 25239 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1216 01:36:24.514523 25239 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1216 01:36:24.514958 25239 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 01:36:24.514993 25239 slave.cpp:547] Agent attributes: [ ]
I1216 01:36:24.515002 25239 slave.cpp:552] Agent hostname: 996f3eb2ebf0
I1216 01:36:24.515535 25234 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_1QIX8u/meta'
I1216 01:36:24.515735 25234 status_update_manager.cpp:203] Recovering status update manager
I1216 01:36:24.515801 25234 containerizer.cpp:594] Recovering containerizer
I1216 01:36:24.516234 25234 provisioner.cpp:253] Provisioner recovery complete
I1216 01:36:24.516360 25234 slave.cpp:5408] Finished recovery
I1216 01:36:24.516757 25234 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1216 01:36:24.516934 25234 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1216 01:36:24.517886 25241 process.cpp:3679] Handling HTTP event for process 'slave(669)' with path: '/slave(669)/monitor/statistics'
I1216 01:36:24.518373 25238 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
I1216 01:36:24.519119 25234 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/0 (13 ms)
[ RUN ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/1
I1216 01:36:24.524811 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1216 01:36:24.525264 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1216 01:36:24.525526 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1216 01:36:24.527482 25236 slave.cpp:209] Mesos agent started on (670)@172.17.0.4:55768
I1216 01:36:24.527508 25236 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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_80edpt/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_80edpt/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_80edpt/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_80edpt" --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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_wEGFxS"
I1216 01:36:24.527815 25236 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_80edpt/credential'
I1216 01:36:24.527925 25236 slave.cpp:352] Agent using credential for: test-principal
I1216 01:36:24.527941 25236 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_80edpt/http_credentials'
I1216 01:36:24.528069 25236 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1216 01:36:24.528138 25236 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1216 01:36:24.528470 25236 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 01:36:24.528502 25236 slave.cpp:547] Agent attributes: [ ]
I1216 01:36:24.528511 25236 slave.cpp:552] Agent hostname: 996f3eb2ebf0
I1216 01:36:24.528910 25233 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_wEGFxS/meta'
I1216 01:36:24.529068 25233 status_update_manager.cpp:203] Recovering status update manager
I1216 01:36:24.529139 25233 containerizer.cpp:594] Recovering containerizer
I1216 01:36:24.529711 25233 provisioner.cpp:253] Provisioner recovery complete
I1216 01:36:24.529860 25233 slave.cpp:5408] Finished recovery
I1216 01:36:24.530534 25233 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1216 01:36:24.530648 25233 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1216 01:36:24.531440 25234 process.cpp:3679] Handling HTTP event for process 'slave(670)' with path: '/slave(670)/monitor/statistics.json'
I1216 01:36:24.531883 25234 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I1216 01:36:24.532811 25230 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/1 (24 ms)
[ RUN ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/2
I1216 01:36:24.549154 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1216 01:36:24.549584 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1216 01:36:24.549690 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1216 01:36:24.551532 25244 slave.cpp:209] Mesos agent started on (671)@172.17.0.4:55768
I1216 01:36:24.551565 25244 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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_vR063Q/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_vR063Q/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_vR063Q/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_vR063Q" --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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_kd6C8f"
I1216 01:36:24.551913 25244 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_vR063Q/credential'
I1216 01:36:24.552048 25244 slave.cpp:352] Agent using credential for: test-principal
I1216 01:36:24.552064 25244 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_vR063Q/http_credentials'
I1216 01:36:24.552191 25244 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1216 01:36:24.552245 25244 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1216 01:36:24.552624 25244 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 01:36:24.552657 25244 slave.cpp:547] Agent attributes: [ ]
I1216 01:36:24.552661 25244 slave.cpp:552] Agent hostname: 996f3eb2ebf0
I1216 01:36:24.553261 25244 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_kd6C8f/meta'
I1216 01:36:24.553411 25244 status_update_manager.cpp:203] Recovering status update manager
I1216 01:36:24.553478 25244 containerizer.cpp:594] Recovering containerizer
I1216 01:36:24.553972 25244 provisioner.cpp:253] Provisioner recovery complete
I1216 01:36:24.554116 25244 slave.cpp:5408] Finished recovery
I1216 01:36:24.554559 25244 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1216 01:36:24.554718 25244 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1216 01:36:24.555763 25240 process.cpp:3679] Handling HTTP event for process 'slave(671)' with path: '/slave(671)/containers'
I1216 01:36:24.556249 25232 http.cpp:874] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I1216 01:36:24.557485 25230 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/2 (14 ms)
[ RUN ] Endpoint/SlaveEndpointTest.NoAuthorizer/0
I1216 01:36:24.562950 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1216 01:36:24.563364 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1216 01:36:24.563454 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1216 01:36:24.564373 25230 cluster.cpp:446] Creating default 'local' authorizer
I1216 01:36:24.565454 25235 slave.cpp:209] Mesos agent started on (672)@172.17.0.4:55768
I1216 01:36:24.565524 25235 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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_zzJDTe/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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_zzJDTe/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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_zzJDTe/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_zzJDTe" --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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_G2VUVD"
I1216 01:36:24.565964 25235 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_zzJDTe/credential'
I1216 01:36:24.566157 25235 slave.cpp:352] Agent using credential for: test-principal
I1216 01:36:24.566336 25235 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_zzJDTe/http_credentials'
I1216 01:36:24.566582 25235 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1216 01:36:24.566757 25235 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1216 01:36:24.567258 25235 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 01:36:24.567291 25235 slave.cpp:547] Agent attributes: [ ]
I1216 01:36:24.567299 25235 slave.cpp:552] Agent hostname: 996f3eb2ebf0
I1216 01:36:24.567806 25242 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_G2VUVD/meta'
I1216 01:36:24.567914 25242 status_update_manager.cpp:203] Recovering status update manager
I1216 01:36:24.568155 25235 containerizer.cpp:594] Recovering containerizer
I1216 01:36:24.568738 25240 provisioner.cpp:253] Provisioner recovery complete
I1216 01:36:24.568964 25240 slave.cpp:5408] Finished recovery
I1216 01:36:24.569542 25240 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1216 01:36:24.569784 25241 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1216 01:36:24.570613 25240 process.cpp:3679] Handling HTTP event for process 'slave(672)' with path: '/slave(672)/monitor/statistics'
I1216 01:36:24.571089 25232 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
I1216 01:36:24.572635 25232 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/0 (18 ms)
[ RUN ] Endpoint/SlaveEndpointTest.NoAuthorizer/1
I1216 01:36:24.580322 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1216 01:36:24.580626 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1216 01:36:24.580718 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1216 01:36:24.581411 25230 cluster.cpp:446] Creating default 'local' authorizer
I1216 01:36:24.582087 25246 slave.cpp:209] Mesos agent started on (673)@172.17.0.4:55768
I1216 01:36:24.582125 25246 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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IPVoUC/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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IPVoUC/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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IPVoUC/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IPVoUC" --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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_mo7LT1"
I1216 01:36:24.582557 25246 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IPVoUC/credential'
I1216 01:36:24.582717 25246 slave.cpp:352] Agent using credential for: test-principal
I1216 01:36:24.582837 25246 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IPVoUC/http_credentials'
I1216 01:36:24.583055 25246 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1216 01:36:24.583134 25246 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1216 01:36:24.583645 25246 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 01:36:24.583679 25246 slave.cpp:547] Agent attributes: [ ]
I1216 01:36:24.583688 25246 slave.cpp:552] Agent hostname: 996f3eb2ebf0
I1216 01:36:24.584367 25243 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_mo7LT1/meta'
I1216 01:36:24.584528 25235 status_update_manager.cpp:203] Recovering status update manager
I1216 01:36:24.584822 25243 containerizer.cpp:594] Recovering containerizer
I1216 01:36:24.585346 25237 provisioner.cpp:253] Provisioner recovery complete
I1216 01:36:24.585490 25234 slave.cpp:5408] Finished recovery
I1216 01:36:24.585883 25234 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1216 01:36:24.586002 25234 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1216 01:36:24.586869 25246 process.cpp:3679] Handling HTTP event for process 'slave(673)' with path: '/slave(673)/monitor/statistics.json'
I1216 01:36:24.587365 25238 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I1216 01:36:24.588836 25230 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/1 (12 ms)
[ RUN ] Endpoint/SlaveEndpointTest.NoAuthorizer/2
I1216 01:36:24.593763 25230 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1216 01:36:24.594123 25230 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1216 01:36:24.594216 25230 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1216 01:36:24.594985 25230 cluster.cpp:446] Creating default 'local' authorizer
I1216 01:36:24.595465 25242 slave.cpp:209] Mesos agent started on (674)@172.17.0.4:55768
I1216 01:36:24.595494 25242 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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_oBte40/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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_oBte40/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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_oBte40/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_oBte40" --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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_9Vts1p"
I1216 01:36:24.595954 25242 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_oBte40/credential'
I1216 01:36:24.596223 25242 slave.cpp:352] Agent using credential for: test-principal
I1216 01:36:24.596261 25242 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_oBte40/http_credentials'
I1216 01:36:24.596585 25242 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1216 01:36:24.596693 25242 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1216 01:36:24.597160 25242 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1216 01:36:24.597203 25242 slave.cpp:547] Agent attributes: [ ]
I1216 01:36:24.597213 25242 slave.cpp:552] Agent hostname: 996f3eb2ebf0
I1216 01:36:24.597774 25231 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_9Vts1p/meta'
I1216 01:36:24.597931 25237 status_update_manager.cpp:203] Recovering status update manager
I1216 01:36:24.598096 25245 containerizer.cpp:594] Recovering containerizer
I1216 01:36:24.598644 25234 provisioner.cpp:253] Provisioner recovery complete
I1216 01:36:24.599006 25243 slave.cpp:5408] Finished recovery
I1216 01:36:24.599464 25243 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1216 01:36:24.599743 25243 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1216 01:36:24.600469 25242 process.cpp:3679] Handling HTTP event for process 'slave(674)' with path: '/slave(674)/containers'
I1216 01:36:24.600852 25242 http.cpp:874] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I1216 01:36:24.602133 25230 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/2 (13 ms)
[----------] 9 tests from Endpoint/SlaveEndpointTest (138 ms total)
[----------] Global test environment tear-down
[==========] 1390 tests from 158 test cases ran. (176575 ms total)
[ PASSED ] 1389 tests.
[ FAILED ] 1 test, listed below:
[ FAILED ] IOSwitchboardTest.KillSwitchboardContainerDestroyed
1 FAILED TEST
YOU HAVE 9 DISABLED TESTS
make[3]: *** [CMakeFiles/check] Error 1
make[3]: Leaving directory `/mesos/build'
make[2]: Leaving directory `/mesos/build'
make[2]: *** [CMakeFiles/check.dir/all] Error 2
make[1]: *** [CMakeFiles/check.dir/rule] Error 2
make[1]: Leaving directory `/mesos/build'
make: *** [check] Error 2
+ docker rmi mesos-1481850064-5240
Untagged: mesos-1481850064-5240:latest
Deleted: sha256:350abd5854e482c8aa7953125604f824729f9d44f70d9d4da73d3f52d708559a
Deleted: sha256:6be6ec26426812f9a9fa0eff6cd4d2119279f4e18dd7ab5fd6a6978ce764ea5b
Deleted: sha256:8ca93ec58f3f3356eb5e228a07970997657aa91c59c844b78e29ac9763f338b3
Deleted: sha256:17ef99e4a806ccd238e600a787518a36bce203112269520a2df06852e9290ba7
Deleted: sha256:d26cc24c247c50b40d4ae32cf9b4a182ab7ac413d677d8a8deeac512502d191f
Deleted: sha256:4afe2f3f313963d627b816886edbd4e6810f416dbc742afd74de4e90d7af7c79
Deleted: sha256:d4fe07644ed11de48ea3997cb6c452344fe61987081f1ace8b0d3adbfa5afb7a
Deleted: sha256:d0796b756018f5d3e6715a1c7e9d2419a3eed545383ba6e3d4ce106b76539f85
Deleted: sha256:e86790b4c212173c14e0532aadcae6b7f2905f805d4919d2d3805b84ef294d4e
Deleted: sha256:068d7be70925549b809ea577d457f615d357e403adff53c402160db429088499
Deleted: sha256:40dff8b76a8d9abfd7d5e32407a7fc0b1aa7324cb4e0073262523761d87be5d9
Deleted: sha256:f1e99d97a3d3d74d58e69bd66ee9e4185219e94584a6bba69a6ba07cb95f78c9
Deleted: sha256:250ae33ae6a4a83dcdbeb288385e7ec4ca671e2c45d360c416f41582027ddd9e
Deleted: sha256:3c2a80bbb8cf62dff685498c602255014f46551ebd7a99e6c5c75d6c4d186f8f
Deleted: sha256:22ba29651401550ceeb12393700c7e1ae62fc537ccb4f15b99f5b5565e76197c
Deleted: sha256:29fe7726916ea231d22e73e85d0557de63d5c2719e210ed8c7d40c62b7a7d4a0
Deleted: sha256:8b1f09b9150f49f97455a89e49e25280fe424c5873909079ab88f895d538135c
Deleted: sha256:4bb16152b649b82c23d92bcac2787983978fe22295ab89c5aca901989fe4a608
Deleted: sha256:cf2f8d9e5876e944a2084c29e85f90c4f4e2a89693cbe04f911eab1de75b58d4
Deleted: sha256:3f05d3eca7c26bf1e5c9be98c38a66f4e2b0d51a10ae662ec17aff98501f9b9f
Deleted: sha256:8139d52b1d635db2767ee7a042d346562807692ab06c37f6b1da917ecd6f2ce0
Deleted: sha256:a876ca40b4524f6871de33f17a600a899d6462b016ae19cdf4b947383b0a8184
Deleted: sha256:4fba2d931d9cec647e84fe71a7790b026f22653d24e3ad5091a2dce6a98c69f8
Deleted: sha256:87b1fcab95520db4c0715242d4dc9bd0fd908008d17184041868a7fbe7a701e1
Build step 'Execute shell' marked build as failure
Build failed in Jenkins: Mesos » cmake,clang,--verbose --enable-libevent --enable-ssl,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2) #3037
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Mesos/BUILDTOOL=cmake,COMPILER=clang,CONFIGURATION=--verbose%20--enable-libevent%20--enable-ssl,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-6)&&(!ubuntu-eu2)/3037/changes>
Changes:
[toenshoff] Used correct shell string comparison operator in test.
[benjamin.hindman] Added a synchronous version of loop for io::read/write/redirect.
[benjamin.hindman] Used process::loop in infinitely recursive functions.
[yujie.jay] Kept the listening socket while accept is in flight.
[yujie.jay] Fixed overlay backend symlink error message.
[vinodkone] Updated contributors.yaml.
[vinodkone] Added tests for IOSwitchboard heartbeat.
[mpark] Fixed a few places to use `foreachkey` / `foreachvalue`.
[mpark] Changed implementation of `LinkedHashMap`.
[mpark] Enhanced `LinkedHashMap` to support `foreachpair` and friends.
[mpark] Modernized code to use `foreachpair` with `LinkedHashMap`.
[mpark] Updated stout's `README`.
[mpark] Removed unused header include from stout's `hashmap`.
[mpark] Updated the Windows doc to refer to `.\support\windows-build.bat`.
------------------------------------------
[...truncated 170417 lines...]
[ OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/0 (12 ms)
[ RUN ] Endpoint/SlaveEndpointTest.AuthorizedRequest/1
I1215 19:48:00.424624 25228 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1215 19:48:00.424937 25228 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1215 19:48:00.425019 25228 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1215 19:48:00.426077 25241 slave.cpp:209] Mesos agent started on (667)@172.17.0.3:54054
I1215 19:48:00.426139 25241 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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_8B0SKR/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_8B0SKR/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_8B0SKR/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_8B0SKR" --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/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_pkegs1"
I1215 19:48:00.426497 25241 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_8B0SKR/credential'
I1215 19:48:00.426585 25241 slave.cpp:352] Agent using credential for: test-principal
I1215 19:48:00.426600 25241 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_8B0SKR/http_credentials'
I1215 19:48:00.426759 25241 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1215 19:48:00.426815 25241 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1215 19:48:00.427189 25241 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1215 19:48:00.427240 25241 slave.cpp:547] Agent attributes: [ ]
I1215 19:48:00.427251 25241 slave.cpp:552] Agent hostname: e107155d8a48
I1215 19:48:00.427775 25238 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_1_pkegs1/meta'
I1215 19:48:00.427971 25238 status_update_manager.cpp:203] Recovering status update manager
I1215 19:48:00.428074 25234 containerizer.cpp:594] Recovering containerizer
I1215 19:48:00.428510 25234 provisioner.cpp:253] Provisioner recovery complete
I1215 19:48:00.428666 25234 slave.cpp:5408] Finished recovery
I1215 19:48:00.429026 25234 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1215 19:48:00.429177 25234 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1215 19:48:00.430044 25243 process.cpp:3679] Handling HTTP event for process 'slave(667)' with path: '/slave(667)/monitor/statistics.json'
I1215 19:48:00.430416 25234 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I1215 19:48:00.431709 25228 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/1 (11 ms)
[ RUN ] Endpoint/SlaveEndpointTest.AuthorizedRequest/2
I1215 19:48:00.436178 25228 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1215 19:48:00.436507 25228 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1215 19:48:00.436627 25228 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1215 19:48:00.437727 25235 slave.cpp:209] Mesos agent started on (668)@172.17.0.3:54054
I1215 19:48:00.437773 25235 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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_TB4K3e/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_TB4K3e/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_TB4K3e/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_TB4K3e" --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/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_YCrfJo"
I1215 19:48:00.438135 25235 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_TB4K3e/credential'
I1215 19:48:00.438292 25235 slave.cpp:352] Agent using credential for: test-principal
I1215 19:48:00.438308 25235 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_TB4K3e/http_credentials'
I1215 19:48:00.438494 25235 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1215 19:48:00.438560 25235 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1215 19:48:00.439034 25235 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1215 19:48:00.439067 25235 slave.cpp:547] Agent attributes: [ ]
I1215 19:48:00.439075 25235 slave.cpp:552] Agent hostname: e107155d8a48
I1215 19:48:00.439666 25241 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_YCrfJo/meta'
I1215 19:48:00.439792 25244 status_update_manager.cpp:203] Recovering status update manager
I1215 19:48:00.439934 25241 containerizer.cpp:594] Recovering containerizer
I1215 19:48:00.440568 25243 provisioner.cpp:253] Provisioner recovery complete
I1215 19:48:00.440855 25233 slave.cpp:5408] Finished recovery
I1215 19:48:00.441287 25233 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1215 19:48:00.441565 25234 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1215 19:48:00.442248 25232 process.cpp:3679] Handling HTTP event for process 'slave(668)' with path: '/slave(668)/containers'
I1215 19:48:00.442664 25237 http.cpp:874] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I1215 19:48:00.443800 25228 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/2 (11 ms)
[ RUN ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/0
I1215 19:48:00.448073 25228 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1215 19:48:00.448364 25228 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1215 19:48:00.448446 25228 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1215 19:48:00.449748 25240 slave.cpp:209] Mesos agent started on (669)@172.17.0.3:54054
I1215 19:48:00.449774 25240 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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_IX4puC/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_IX4puC/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_IX4puC/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_IX4puC" --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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_TjvY7L"
I1215 19:48:00.450245 25240 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_IX4puC/credential'
I1215 19:48:00.450337 25240 slave.cpp:352] Agent using credential for: test-principal
I1215 19:48:00.450347 25240 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_IX4puC/http_credentials'
I1215 19:48:00.450505 25240 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1215 19:48:00.450583 25240 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1215 19:48:00.450954 25240 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1215 19:48:00.450999 25240 slave.cpp:547] Agent attributes: [ ]
I1215 19:48:00.451011 25240 slave.cpp:552] Agent hostname: e107155d8a48
I1215 19:48:00.451500 25238 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_TjvY7L/meta'
I1215 19:48:00.451753 25233 status_update_manager.cpp:203] Recovering status update manager
I1215 19:48:00.451822 25233 containerizer.cpp:594] Recovering containerizer
I1215 19:48:00.452487 25231 provisioner.cpp:253] Provisioner recovery complete
I1215 19:48:00.452728 25240 slave.cpp:5408] Finished recovery
I1215 19:48:00.453174 25240 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1215 19:48:00.453316 25234 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1215 19:48:00.454035 25237 process.cpp:3679] Handling HTTP event for process 'slave(669)' with path: '/slave(669)/monitor/statistics'
I1215 19:48:00.454448 25229 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
I1215 19:48:00.455535 25235 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/0 (16 ms)
[ RUN ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/1
I1215 19:48:00.465037 25228 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1215 19:48:00.465371 25228 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1215 19:48:00.465458 25228 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1215 19:48:00.466486 25235 slave.cpp:209] Mesos agent started on (670)@172.17.0.3:54054
I1215 19:48:00.466511 25235 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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_HaCj5Z/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_HaCj5Z/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_HaCj5Z/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_HaCj5Z" --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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_FYI6F9"
I1215 19:48:00.466962 25235 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_HaCj5Z/credential'
I1215 19:48:00.467047 25235 slave.cpp:352] Agent using credential for: test-principal
I1215 19:48:00.467062 25235 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_HaCj5Z/http_credentials'
I1215 19:48:00.467147 25235 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1215 19:48:00.467195 25235 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1215 19:48:00.467509 25235 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1215 19:48:00.467540 25235 slave.cpp:547] Agent attributes: [ ]
I1215 19:48:00.467546 25235 slave.cpp:552] Agent hostname: e107155d8a48
I1215 19:48:00.467890 25234 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_FYI6F9/meta'
I1215 19:48:00.468017 25237 status_update_manager.cpp:203] Recovering status update manager
I1215 19:48:00.468137 25234 containerizer.cpp:594] Recovering containerizer
I1215 19:48:00.468775 25242 provisioner.cpp:253] Provisioner recovery complete
I1215 19:48:00.468981 25242 slave.cpp:5408] Finished recovery
I1215 19:48:00.469318 25242 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1215 19:48:00.469532 25236 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1215 19:48:00.470209 25242 process.cpp:3679] Handling HTTP event for process 'slave(670)' with path: '/slave(670)/monitor/statistics.json'
I1215 19:48:00.474570 25229 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I1215 19:48:00.475580 25242 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/1 (14 ms)
[ RUN ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/2
I1215 19:48:00.480788 25228 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1215 19:48:00.481107 25228 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1215 19:48:00.481225 25228 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1215 19:48:00.482295 25236 slave.cpp:209] Mesos agent started on (671)@172.17.0.3:54054
I1215 19:48:00.482316 25236 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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_j69hQn/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_j69hQn/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_j69hQn/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_j69hQn" --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/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_bMQzox"
I1215 19:48:00.482668 25236 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_j69hQn/credential'
I1215 19:48:00.482758 25236 slave.cpp:352] Agent using credential for: test-principal
I1215 19:48:00.482774 25236 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_j69hQn/http_credentials'
I1215 19:48:00.482892 25236 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1215 19:48:00.482949 25236 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1215 19:48:00.483325 25236 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1215 19:48:00.483358 25236 slave.cpp:547] Agent attributes: [ ]
I1215 19:48:00.483368 25236 slave.cpp:552] Agent hostname: e107155d8a48
I1215 19:48:00.483737 25241 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_bMQzox/meta'
I1215 19:48:00.483966 25242 status_update_manager.cpp:203] Recovering status update manager
I1215 19:48:00.484144 25232 containerizer.cpp:594] Recovering containerizer
I1215 19:48:00.484621 25233 provisioner.cpp:253] Provisioner recovery complete
I1215 19:48:00.484897 25235 slave.cpp:5408] Finished recovery
I1215 19:48:00.485234 25235 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1215 19:48:00.485337 25239 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1215 19:48:00.485971 25234 process.cpp:3679] Handling HTTP event for process 'slave(671)' with path: '/slave(671)/containers'
I1215 19:48:00.486357 25243 http.cpp:874] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I1215 19:48:00.487449 25228 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/2 (11 ms)
[ RUN ] Endpoint/SlaveEndpointTest.NoAuthorizer/0
I1215 19:48:00.492988 25228 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1215 19:48:00.493376 25228 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1215 19:48:00.493468 25228 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1215 19:48:00.494160 25228 cluster.cpp:446] Creating default 'local' authorizer
I1215 19:48:00.494734 25243 slave.cpp:209] Mesos agent started on (672)@172.17.0.3:54054
I1215 19:48:00.494758 25243 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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_i2hDJL/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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_i2hDJL/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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_i2hDJL/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_i2hDJL" --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/Endpoint_SlaveEndpointTest_NoAuthorizer_0_pROZfV"
I1215 19:48:00.495146 25243 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_i2hDJL/credential'
I1215 19:48:00.495230 25243 slave.cpp:352] Agent using credential for: test-principal
I1215 19:48:00.495242 25243 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_i2hDJL/http_credentials'
I1215 19:48:00.495368 25243 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1215 19:48:00.495446 25243 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1215 19:48:00.495848 25243 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1215 19:48:00.495879 25243 slave.cpp:547] Agent attributes: [ ]
I1215 19:48:00.495883 25243 slave.cpp:552] Agent hostname: e107155d8a48
I1215 19:48:00.496253 25231 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_pROZfV/meta'
I1215 19:48:00.496425 25231 status_update_manager.cpp:203] Recovering status update manager
I1215 19:48:00.496604 25236 containerizer.cpp:594] Recovering containerizer
I1215 19:48:00.497305 25235 provisioner.cpp:253] Provisioner recovery complete
I1215 19:48:00.497542 25237 slave.cpp:5408] Finished recovery
I1215 19:48:00.497927 25237 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1215 19:48:00.498028 25243 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1215 19:48:00.498698 25240 process.cpp:3679] Handling HTTP event for process 'slave(672)' with path: '/slave(672)/monitor/statistics'
I1215 19:48:00.499161 25239 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
I1215 19:48:00.500366 25240 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/0 (12 ms)
[ RUN ] Endpoint/SlaveEndpointTest.NoAuthorizer/1
I1215 19:48:00.505172 25228 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1215 19:48:00.505519 25228 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1215 19:48:00.505632 25228 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1215 19:48:00.506332 25228 cluster.cpp:446] Creating default 'local' authorizer
I1215 19:48:00.507153 25240 slave.cpp:209] Mesos agent started on (673)@172.17.0.3:54054
I1215 19:48:00.507180 25240 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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_I4tcL9/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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_I4tcL9/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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_I4tcL9/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_I4tcL9" --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/Endpoint_SlaveEndpointTest_NoAuthorizer_1_Dhswfj"
I1215 19:48:00.507550 25240 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_I4tcL9/credential'
I1215 19:48:00.507663 25240 slave.cpp:352] Agent using credential for: test-principal
I1215 19:48:00.507679 25240 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_I4tcL9/http_credentials'
I1215 19:48:00.507798 25240 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1215 19:48:00.507853 25240 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1215 19:48:00.508316 25240 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1215 19:48:00.508361 25240 slave.cpp:547] Agent attributes: [ ]
I1215 19:48:00.508371 25240 slave.cpp:552] Agent hostname: e107155d8a48
I1215 19:48:00.508824 25241 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_Dhswfj/meta'
I1215 19:48:00.509057 25232 status_update_manager.cpp:203] Recovering status update manager
I1215 19:48:00.509205 25236 containerizer.cpp:594] Recovering containerizer
I1215 19:48:00.509829 25243 provisioner.cpp:253] Provisioner recovery complete
I1215 19:48:00.510110 25243 slave.cpp:5408] Finished recovery
I1215 19:48:00.510628 25243 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1215 19:48:00.510800 25231 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1215 19:48:00.511391 25236 process.cpp:3679] Handling HTTP event for process 'slave(673)' with path: '/slave(673)/monitor/statistics.json'
I1215 19:48:00.511795 25242 http.cpp:874] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I1215 19:48:00.512825 25236 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/1 (12 ms)
[ RUN ] Endpoint/SlaveEndpointTest.NoAuthorizer/2
I1215 19:48:00.517382 25228 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W1215 19:48:00.517705 25228 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges, but is running as user mesos
W1215 19:48:00.517798 25228 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1215 19:48:00.518488 25228 cluster.cpp:446] Creating default 'local' authorizer
I1215 19:48:00.518980 25230 slave.cpp:209] Mesos agent started on (674)@172.17.0.3:54054
I1215 19:48:00.519143 25230 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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_YpAQUx/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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_YpAQUx/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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_YpAQUx/http_credentials" --http_heartbeat_interval="30secs" --image_provisioner_backend="copy" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_YpAQUx" --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/Endpoint_SlaveEndpointTest_NoAuthorizer_2_SI19mH"
I1215 19:48:00.519546 25230 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_YpAQUx/credential'
I1215 19:48:00.519645 25230 slave.cpp:352] Agent using credential for: test-principal
I1215 19:48:00.519681 25230 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_YpAQUx/http_credentials'
I1215 19:48:00.519803 25230 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1215 19:48:00.519857 25230 http.cpp:922] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I1215 19:48:00.520267 25230 slave.cpp:539] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I1215 19:48:00.520314 25230 slave.cpp:547] Agent attributes: [ ]
I1215 19:48:00.520325 25230 slave.cpp:552] Agent hostname: e107155d8a48
I1215 19:48:00.520761 25241 state.cpp:57] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_SI19mH/meta'
I1215 19:48:00.520905 25241 status_update_manager.cpp:203] Recovering status update manager
I1215 19:48:00.521178 25234 containerizer.cpp:594] Recovering containerizer
I1215 19:48:00.521953 25234 provisioner.cpp:253] Provisioner recovery complete
I1215 19:48:00.522189 25243 slave.cpp:5408] Finished recovery
I1215 19:48:00.522794 25243 slave.cpp:5582] Querying resource estimator for oversubscribable resources
I1215 19:48:00.523020 25229 slave.cpp:5596] Received oversubscribable resources {} from the resource estimator
I1215 19:48:00.524125 25242 process.cpp:3679] Handling HTTP event for process 'slave(674)' with path: '/slave(674)/containers'
I1215 19:48:00.524688 25233 http.cpp:874] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I1215 19:48:00.526509 25228 slave.cpp:796] Agent terminating
[ OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/2 (14 ms)
[----------] 9 tests from Endpoint/SlaveEndpointTest (120 ms total)
[----------] Global test environment tear-down
[==========] 1390 tests from 158 test cases ran. (175606 ms total)
[ PASSED ] 1389 tests.
[ FAILED ] 1 test, listed below:
[ FAILED ] IOSwitchboardTest.KillSwitchboardContainerDestroyed
1 FAILED TEST
YOU HAVE 9 DISABLED TESTS
make[3]: Leaving directory `/mesos/build'
make[3]: *** [CMakeFiles/check] Error 1
make[2]: *** [CMakeFiles/check.dir/all] Error 2
make[2]: Leaving directory `/mesos/build'
make[1]: *** [CMakeFiles/check.dir/rule] Error 2
make[1]: Leaving directory `/mesos/build'
make: *** [check] Error 2
+ docker rmi mesos-1481829022-459
Untagged: mesos-1481829022-459:latest
Deleted: sha256:107953c6d60a48ca8a1330abc4ddb58d0d74a4c4506b61bd4e5a1bbc19dc982d
Deleted: sha256:57f316af8058baf86fb1a4cdc5eff67bb4c1768c2aa18545dc8d431d43990ee4
Deleted: sha256:8be42443c8652ff94276cf647d2e3f876085dd87fe22a56238e7d7df5d5e10ac
Deleted: sha256:f2fd44ad385a726d040c0539d8ef1740680c8b5e3dbb1365c7a57d5a2a2be8d3
Deleted: sha256:8c413e0dd2534aebe0367d52b442f6880cc553a28edd415744fcff7cbd08b213
Deleted: sha256:c727c50effbc082927dbc0a8027edf0b8868a562632b57b90c1a5908ae4ed608
Deleted: sha256:6a6ccdfbe9eeba7c4c6cede1bcf398bba0403410c16d4b5eca47d1d2712f4d36
Deleted: sha256:218cd51cee243d3caeec142de09b1e5cb8f1883cb585a00a5bb98db4019f1d70
Deleted: sha256:d76be57b5b93c1b584863c93055aeecbcadeae935f2c32a02fae950fc50ea43a
Deleted: sha256:d589dc7ee3ef92e6ce26a91c864371cafb573407d34cf11127a52183cab675ee
Deleted: sha256:f29f4eeebd58be9f4686aa1cd4f7b06cfb4aff5eb47099918ab64fbba7e4fe5c
Deleted: sha256:42dcd5a702174a3ce3f53ff7d4e5e9b4d7b2907fa19c2eb47b24a5d7c5ed5699
Deleted: sha256:885b4475c53df8a44e2f53354920ba0591724c4cf0dca0227870032406166d7c
Deleted: sha256:0249129a57ef59b302cf215de88de421406bccec3d7045eff472e5eb80058e06
Deleted: sha256:bf76b58869878b5ee71e59059b35791eb0b5461d1853260e2a8306e45cd0dc6a
Deleted: sha256:55434c38a33d27c4bd21fd42da43cf586213ee14c54952091edecb7d4e49f280
Deleted: sha256:55dfb1de4db7f2373dd70f1da1d3c79b2d9583e1338b5eb363b490358521d446
Deleted: sha256:b02b707cb3e5c780a4cef8912d91e003191d4d26532f1eddbc6e3b7cc2fc1092
Deleted: sha256:c9ada4d3c0a84c4284be387d9c7c8b2c71c790e506c961aacfc57d40a7d2dacf
Deleted: sha256:658387b8f68b9e4d7b37e4016cf16c629d1b958f133d5c6f2ffea525a64ac532
Deleted: sha256:6cccdb7177f009666fbe4f114c99501a4260c58819655935b4b0ee9e8fb87965
Deleted: sha256:943319d354f7b4a8b10b2787a4ec072754577b7763a86c5540bfbe30d4d1a69a
Deleted: sha256:912ed0a1d00e3da7c7e3897d6b9b82271219547a1697bd6ebde598e92c3fc3db
Deleted: sha256:1ab4149a4bf50530706cfe67b3d86038f26ba862a293a718a5c186da45325c71
Build step 'Execute shell' marked build as failure