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 2017/02/24 01:10:45 UTC

Build failed in Jenkins: Mesos-Buildbot » autotools,clang,--verbose,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2) #3302

See <https://builds.apache.org/job/Mesos-Buildbot/BUILDTOOL=autotools,COMPILER=clang,CONFIGURATION=--verbose,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2)/3302/display/redirect>

------------------------------------------
[...truncated 26.00 MB...]
I0224 01:10:37.606077 28888 status_update_manager.cpp:203] Recovering status update manager
I0224 01:10:37.606351 28879 containerizer.cpp:599] Recovering containerizer
I0224 01:10:37.607841 28879 provisioner.cpp:410] Provisioner recovery complete
I0224 01:10:37.608230 28887 slave.cpp:5559] Finished recovery
I0224 01:10:37.608913 28887 slave.cpp:5733] Querying resource estimator for oversubscribable resources
I0224 01:10:37.609153 28879 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
I0224 01:10:37.611608 28889 process.cpp:3704] Handling HTTP event for process 'slave(704)' with path: '/slave(704)/monitor/statistics.json'
I0224 01:10:37.613068 28892 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I0224 01:10:37.616667 28880 slave.cpp:803] Agent terminating
[       OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/1 (31 ms)
[ RUN      ] Endpoint/SlaveEndpointTest.AuthorizedRequest/2
I0224 01:10:37.627491 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W0224 01:10:37.628049 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W0224 01:10:37.628170 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I0224 01:10:37.628218 28861 provisioner.cpp:249] Using default backend 'copy'
I0224 01:10:37.631695 28894 slave.cpp:211] Mesos agent started on (705)@172.17.0.3:57391
I0224 01:10:37.631814 28894 slave.cpp:212] 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_PhBQMa/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_PhBQMa/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_PhBQMa/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_PhBQMa" --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_kJIbfo"
I0224 01:10:37.632803 28894 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_PhBQMa/credential'
I0224 01:10:37.633015 28894 slave.cpp:354] Agent using credential for: test-principal
I0224 01:10:37.633052 28894 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_PhBQMa/http_credentials'
I0224 01:10:37.633422 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I0224 01:10:37.633579 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I0224 01:10:37.635062 28894 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I0224 01:10:37.635162 28894 slave.cpp:549] Agent attributes: [  ]
I0224 01:10:37.635180 28894 slave.cpp:554] Agent hostname: 9dd6373ba1f4
I0224 01:10:37.635344 28885 status_update_manager.cpp:177] Pausing sending status updates
I0224 01:10:37.636610 28883 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_kJIbfo/meta'
I0224 01:10:37.636945 28880 status_update_manager.cpp:203] Recovering status update manager
I0224 01:10:37.637228 28889 containerizer.cpp:599] Recovering containerizer
I0224 01:10:37.638520 28885 provisioner.cpp:410] Provisioner recovery complete
I0224 01:10:37.638943 28889 slave.cpp:5559] Finished recovery
I0224 01:10:37.639472 28889 slave.cpp:5733] Querying resource estimator for oversubscribable resources
I0224 01:10:37.639710 28892 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
I0224 01:10:37.642117 28886 process.cpp:3704] Handling HTTP event for process 'slave(705)' with path: '/slave(705)/containers'
I0224 01:10:37.643296 28881 http.cpp:885] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I0224 01:10:37.646500 28887 slave.cpp:803] Agent terminating
[       OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/2 (29 ms)
[ RUN      ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/0
I0224 01:10:37.656749 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W0224 01:10:37.657274 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W0224 01:10:37.657387 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I0224 01:10:37.657451 28861 provisioner.cpp:249] Using default backend 'copy'
I0224 01:10:37.660540 28885 slave.cpp:211] Mesos agent started on (706)@172.17.0.3:57391
I0224 01:10:37.660595 28885 slave.cpp:212] 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_BjBRdj/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_BjBRdj/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_BjBRdj/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_BjBRdj" --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_nRUpBw"
I0224 01:10:37.661310 28885 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_BjBRdj/credential'
I0224 01:10:37.661489 28885 slave.cpp:354] Agent using credential for: test-principal
I0224 01:10:37.661515 28885 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_BjBRdj/http_credentials'
I0224 01:10:37.661803 28885 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I0224 01:10:37.661965 28885 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I0224 01:10:37.663514 28885 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I0224 01:10:37.663616 28885 slave.cpp:549] Agent attributes: [  ]
I0224 01:10:37.663633 28885 slave.cpp:554] Agent hostname: 9dd6373ba1f4
I0224 01:10:37.663806 28892 status_update_manager.cpp:177] Pausing sending status updates
I0224 01:10:37.665499 28880 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_nRUpBw/meta'
I0224 01:10:37.665721 28879 status_update_manager.cpp:203] Recovering status update manager
I0224 01:10:37.666121 28882 containerizer.cpp:599] Recovering containerizer
I0224 01:10:37.667600 28892 provisioner.cpp:410] Provisioner recovery complete
I0224 01:10:37.668023 28889 slave.cpp:5559] Finished recovery
I0224 01:10:37.668529 28889 slave.cpp:5733] Querying resource estimator for oversubscribable resources
I0224 01:10:37.668881 28893 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
I0224 01:10:37.671102 28892 process.cpp:3704] Handling HTTP event for process 'slave(706)' with path: '/slave(706)/monitor/statistics'
I0224 01:10:37.672535 28888 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
I0224 01:10:37.675073 28886 slave.cpp:803] Agent terminating
[       OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/0 (29 ms)
[ RUN      ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/1
I0224 01:10:37.686686 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W0224 01:10:37.687245 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W0224 01:10:37.687358 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I0224 01:10:37.687397 28861 provisioner.cpp:249] Using default backend 'copy'
I0224 01:10:37.691396 28894 slave.cpp:211] Mesos agent started on (707)@172.17.0.3:57391
I0224 01:10:37.691447 28894 slave.cpp:212] 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_INI7Xr/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_INI7Xr/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_INI7Xr/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_INI7Xr" --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_kwVPgF"
I0224 01:10:37.692136 28894 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_INI7Xr/credential'
I0224 01:10:37.692313 28894 slave.cpp:354] Agent using credential for: test-principal
I0224 01:10:37.692347 28894 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_INI7Xr/http_credentials'
I0224 01:10:37.692679 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I0224 01:10:37.692824 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I0224 01:10:37.694669 28894 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I0224 01:10:37.694774 28894 slave.cpp:549] Agent attributes: [  ]
I0224 01:10:37.694800 28894 slave.cpp:554] Agent hostname: 9dd6373ba1f4
I0224 01:10:37.695000 28893 status_update_manager.cpp:177] Pausing sending status updates
I0224 01:10:37.696518 28890 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_kwVPgF/meta'
I0224 01:10:37.696867 28880 status_update_manager.cpp:203] Recovering status update manager
I0224 01:10:37.697351 28886 containerizer.cpp:599] Recovering containerizer
I0224 01:10:37.699077 28879 provisioner.cpp:410] Provisioner recovery complete
I0224 01:10:37.699513 28880 slave.cpp:5559] Finished recovery
I0224 01:10:37.700151 28880 slave.cpp:5733] Querying resource estimator for oversubscribable resources
I0224 01:10:37.700419 28893 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
I0224 01:10:37.703001 28892 process.cpp:3704] Handling HTTP event for process 'slave(707)' with path: '/slave(707)/monitor/statistics.json'
I0224 01:10:37.704497 28879 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I0224 01:10:37.707386 28889 slave.cpp:803] Agent terminating
[       OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/1 (32 ms)
[ RUN      ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/2
I0224 01:10:37.718793 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W0224 01:10:37.719359 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W0224 01:10:37.719476 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I0224 01:10:37.719527 28861 provisioner.cpp:249] Using default backend 'copy'
I0224 01:10:37.722915 28894 slave.cpp:211] Mesos agent started on (708)@172.17.0.3:57391
I0224 01:10:37.722955 28894 slave.cpp:212] 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_g2A32A/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_g2A32A/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_g2A32A/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_g2A32A" --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_5TqzgO"
I0224 01:10:37.723620 28894 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_g2A32A/credential'
I0224 01:10:37.723808 28894 slave.cpp:354] Agent using credential for: test-principal
I0224 01:10:37.723835 28894 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_g2A32A/http_credentials'
I0224 01:10:37.724117 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I0224 01:10:37.724284 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I0224 01:10:37.726049 28894 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I0224 01:10:37.726151 28894 slave.cpp:549] Agent attributes: [  ]
I0224 01:10:37.726169 28894 slave.cpp:554] Agent hostname: 9dd6373ba1f4
I0224 01:10:37.726307 28893 status_update_manager.cpp:177] Pausing sending status updates
I0224 01:10:37.727744 28884 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_5TqzgO/meta'
I0224 01:10:37.728090 28887 status_update_manager.cpp:203] Recovering status update manager
I0224 01:10:37.728317 28889 containerizer.cpp:599] Recovering containerizer
I0224 01:10:37.729979 28882 provisioner.cpp:410] Provisioner recovery complete
I0224 01:10:37.730438 28886 slave.cpp:5559] Finished recovery
I0224 01:10:37.730985 28886 slave.cpp:5733] Querying resource estimator for oversubscribable resources
I0224 01:10:37.731300 28894 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
I0224 01:10:37.733644 28893 process.cpp:3704] Handling HTTP event for process 'slave(708)' with path: '/slave(708)/containers'
I0224 01:10:37.734948 28888 http.cpp:885] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I0224 01:10:37.737732 28883 slave.cpp:803] Agent terminating
[       OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/2 (30 ms)
[ RUN      ] Endpoint/SlaveEndpointTest.NoAuthorizer/0
I0224 01:10:37.749266 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W0224 01:10:37.749868 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W0224 01:10:37.749980 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I0224 01:10:37.750030 28861 provisioner.cpp:249] Using default backend 'copy'
I0224 01:10:37.752073 28861 cluster.cpp:446] Creating default 'local' authorizer
I0224 01:10:37.753821 28894 slave.cpp:211] Mesos agent started on (709)@172.17.0.3:57391
I0224 01:10:37.753870 28894 slave.cpp:212] 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_Kv9GrK/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_Kv9GrK/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_Kv9GrK/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_Kv9GrK" --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_5S4jAX"
I0224 01:10:37.754535 28894 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_Kv9GrK/credential'
I0224 01:10:37.754701 28894 slave.cpp:354] Agent using credential for: test-principal
I0224 01:10:37.754729 28894 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_Kv9GrK/http_credentials'
I0224 01:10:37.754981 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I0224 01:10:37.755126 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I0224 01:10:37.756851 28894 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I0224 01:10:37.756952 28894 slave.cpp:549] Agent attributes: [  ]
I0224 01:10:37.756969 28894 slave.cpp:554] Agent hostname: 9dd6373ba1f4
I0224 01:10:37.757191 28892 status_update_manager.cpp:177] Pausing sending status updates
I0224 01:10:37.758705 28879 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_5S4jAX/meta'
I0224 01:10:37.759011 28884 status_update_manager.cpp:203] Recovering status update manager
I0224 01:10:37.759387 28882 containerizer.cpp:599] Recovering containerizer
I0224 01:10:37.761096 28891 provisioner.cpp:410] Provisioner recovery complete
I0224 01:10:37.761623 28886 slave.cpp:5559] Finished recovery
I0224 01:10:37.762140 28886 slave.cpp:5733] Querying resource estimator for oversubscribable resources
I0224 01:10:37.762481 28879 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
I0224 01:10:37.764935 28887 process.cpp:3704] Handling HTTP event for process 'slave(709)' with path: '/slave(709)/monitor/statistics'
I0224 01:10:37.766314 28885 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
I0224 01:10:37.770947 28891 slave.cpp:803] Agent terminating
[       OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/0 (33 ms)
[ RUN      ] Endpoint/SlaveEndpointTest.NoAuthorizer/1
I0224 01:10:37.782487 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W0224 01:10:37.783035 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W0224 01:10:37.783149 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I0224 01:10:37.783188 28861 provisioner.cpp:249] Using default backend 'copy'
I0224 01:10:37.785655 28861 cluster.cpp:446] Creating default 'local' authorizer
I0224 01:10:37.787626 28887 slave.cpp:211] Mesos agent started on (710)@172.17.0.3:57391
I0224 01:10:37.787678 28887 slave.cpp:212] 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_IwGzbU/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_IwGzbU/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_IwGzbU/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IwGzbU" --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_D5iOe7"
I0224 01:10:37.788359 28887 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IwGzbU/credential'
I0224 01:10:37.788559 28887 slave.cpp:354] Agent using credential for: test-principal
I0224 01:10:37.788604 28887 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IwGzbU/http_credentials'
I0224 01:10:37.788933 28887 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I0224 01:10:37.789100 28887 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I0224 01:10:37.790766 28887 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I0224 01:10:37.790868 28887 slave.cpp:549] Agent attributes: [  ]
I0224 01:10:37.790886 28887 slave.cpp:554] Agent hostname: 9dd6373ba1f4
I0224 01:10:37.791034 28886 status_update_manager.cpp:177] Pausing sending status updates
I0224 01:10:37.792815 28882 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_D5iOe7/meta'
I0224 01:10:37.793119 28892 status_update_manager.cpp:203] Recovering status update manager
I0224 01:10:37.793375 28880 containerizer.cpp:599] Recovering containerizer
I0224 01:10:37.794988 28880 provisioner.cpp:410] Provisioner recovery complete
I0224 01:10:37.795567 28894 slave.cpp:5559] Finished recovery
I0224 01:10:37.796197 28894 slave.cpp:5733] Querying resource estimator for oversubscribable resources
I0224 01:10:37.796483 28886 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
I0224 01:10:37.799302 28889 process.cpp:3704] Handling HTTP event for process 'slave(710)' with path: '/slave(710)/monitor/statistics.json'
I0224 01:10:37.800845 28892 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
I0224 01:10:37.804801 28885 slave.cpp:803] Agent terminating
[       OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/1 (33 ms)
[ RUN      ] Endpoint/SlaveEndpointTest.NoAuthorizer/2
I0224 01:10:37.816818 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
W0224 01:10:37.817299 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W0224 01:10:37.817411 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I0224 01:10:37.817453 28861 provisioner.cpp:249] Using default backend 'copy'
I0224 01:10:37.818953 28861 cluster.cpp:446] Creating default 'local' authorizer
I0224 01:10:37.820710 28893 slave.cpp:211] Mesos agent started on (711)@172.17.0.3:57391
I0224 01:10:37.820762 28893 slave.cpp:212] 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_QnHIh4/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_QnHIh4/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_QnHIh4/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_QnHIh4" --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_L6Pmfh"
I0224 01:10:37.821667 28893 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_QnHIh4/credential'
I0224 01:10:37.821854 28893 slave.cpp:354] Agent using credential for: test-principal
I0224 01:10:37.821882 28893 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_QnHIh4/http_credentials'
I0224 01:10:37.822144 28893 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I0224 01:10:37.822294 28893 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I0224 01:10:37.823861 28893 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I0224 01:10:37.823969 28893 slave.cpp:549] Agent attributes: [  ]
I0224 01:10:37.823999 28893 slave.cpp:554] Agent hostname: 9dd6373ba1f4
I0224 01:10:37.824177 28890 status_update_manager.cpp:177] Pausing sending status updates
I0224 01:10:37.825611 28889 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_L6Pmfh/meta'
I0224 01:10:37.825848 28881 status_update_manager.cpp:203] Recovering status update manager
I0224 01:10:37.826079 28883 containerizer.cpp:599] Recovering containerizer
I0224 01:10:37.827441 28886 provisioner.cpp:410] Provisioner recovery complete
I0224 01:10:37.827896 28883 slave.cpp:5559] Finished recovery
I0224 01:10:37.828443 28883 slave.cpp:5733] Querying resource estimator for oversubscribable resources
I0224 01:10:37.828754 28887 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
I0224 01:10:37.830690 28894 process.cpp:3704] Handling HTTP event for process 'slave(711)' with path: '/slave(711)/containers'
I0224 01:10:37.831868 28884 http.cpp:885] Authorizing principal 'test-principal' to GET the '/containers' endpoint
I0224 01:10:37.835711 28879 slave.cpp:803] Agent terminating
[       OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/2 (29 ms)
[----------] 9 tests from Endpoint/SlaveEndpointTest (285 ms total)

[----------] Global test environment tear-down
[==========] 1507 tests from 169 test cases ran. (422757 ms total)
[  PASSED  ] 1506 tests.
[  FAILED  ] 1 test, listed below:
[  FAILED  ] OversubscriptionTest.RescindRevocableOfferWithIncreasedRevocable

 1 FAILED TEST
  YOU HAVE 12 DISABLED TESTS

make[4]: *** [check-local] Error 1
make[4]: Leaving directory `/mesos/mesos-1.3.0/_build/src'
make[3]: *** [check-am] Error 2
make[3]: Leaving directory `/mesos/mesos-1.3.0/_build/src'
make[2]: *** [check] Error 2
make[2]: Leaving directory `/mesos/mesos-1.3.0/_build/src'
make[1]: *** [check-recursive] Error 1
make[1]: Leaving directory `/mesos/mesos-1.3.0/_build'
make: *** [distcheck] Error 1
+ docker rmi mesos-1487896046-21621
Untagged: mesos-1487896046-21621:latest
Deleted: sha256:2f9ff115b877a0fd5f765abd83e198caff9be2dd8182424bfc5834827eaf926c
Deleted: sha256:5418a86f725c5de155f5354ed62399de4a13252ff171a7e6162ed0ea9b0503cd
Deleted: sha256:b6f928ed526a57c876e50e2509b82eacb1287bba484bb14d841c708c76bd440c
Deleted: sha256:2c1be6dcc89ed66f2d0ac288edaf5cbb0d1796290b83c1dd8c7e81ea24dda759
Deleted: sha256:469de6c2cd25263014e02d150635cf508f3f74570da74f311b3646dc7e1c32d3
Deleted: sha256:2923a378d8942f6cafe639ddc7a07aa8eb5a5d69fc0e0611b73b8aafaa0d94a1
Deleted: sha256:453662ce314abec890ff9a63fa5b0ee853dfacfa431264a3ebb763520182b1f6
Deleted: sha256:4d4f485458a10c777d6149a15ba68959e17f2d3cbc396a675c2e8f6df95fd3da
Deleted: sha256:5d556172201e7ad6ff4e1d6507e74da34ff24b8c567a22935f8a5ec337f5693f
Deleted: sha256:a323d91ea447d4faf3eafdb9a089d57334d3b4ff22a3ed24a782c3fed3dd667a
Deleted: sha256:06f8a6880dff91a5ddefc43ae5cae9945ba7cd9b023cc061d292835a35188351
Deleted: sha256:fcc7de2e4bd7abbd208636d4f8c007dbd0a40c0aa23796c6cde32d35febd223b
Deleted: sha256:d3a1512898a09eb215b590bcac4ff581cb82059815f958c58e6ea375e1f98b5b
Deleted: sha256:a90459c84b0c7b9c9b260178ad4826a2ae3c6e6d81f793a84f47ac12eccd499b
Deleted: sha256:4eb725cc015c5d17b95b0f6789e9f5eb8f5ee2ba672ae71876fdde6e37989800
Deleted: sha256:1ddb9bc96d05268c1c6c256471db2db3cd82a4ae314a2416481062dbc4e2cbfe
Deleted: sha256:c383161f7c48966bc0b55762783a70dccec04418d0dc3892edbff542deade1c6
Deleted: sha256:02cd10a7627cc87bb134bae9adf258ba942aa96e96a3d0a5174fb7619586bdca
Deleted: sha256:73d41f836cadd76970180375161461aff0fbbe09c6175c4d54bb6276e921e2e6
Deleted: sha256:2a65a3c9cb33b6afe06a0697aad705e30e22c5ec0c4778da76ceb372405a0f57
Deleted: sha256:77efebe9a99cfab69ed688163ce6467ec5d71f1bacd564d8c686bc280e8aaa22
Deleted: sha256:843aeb604fe15dac54645aa8bb7a749823a6d4e45c4023f6cf1ed06dff25059a
Deleted: sha256:f65a3d8818436adb6fcb0b6e2af43570e684e91626439bc779661a7fd8140fda
Deleted: sha256:c06d99e71539fed6865a0dfeb3f4e1c120f570d389a8047156c05cebd3726d50
Build step 'Execute shell' marked build as failure

Re: Build failed in Jenkins: Mesos-Buildbot » autotools,clang,--verbose,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2) #3302

Posted by Anand Mazumdar <an...@mesosphere.io>.
This looks new. Might be related to the multi role changes as this test was modified recently?

-anand

> On Feb 23, 2017, at 5:10 PM, Apache Jenkins Server <je...@builds.apache.org> wrote:
> 
> See <https://builds.apache.org/job/Mesos-Buildbot/BUILDTOOL=autotools,COMPILER=clang,CONFIGURATION=--verbose,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2)/3302/display/redirect>
> 
> ------------------------------------------
> [...truncated 26.00 MB...]
> I0224 01:10:37.606077 28888 status_update_manager.cpp:203] Recovering status update manager
> I0224 01:10:37.606351 28879 containerizer.cpp:599] Recovering containerizer
> I0224 01:10:37.607841 28879 provisioner.cpp:410] Provisioner recovery complete
> I0224 01:10:37.608230 28887 slave.cpp:5559] Finished recovery
> I0224 01:10:37.608913 28887 slave.cpp:5733] Querying resource estimator for oversubscribable resources
> I0224 01:10:37.609153 28879 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
> I0224 01:10:37.611608 28889 process.cpp:3704] Handling HTTP event for process 'slave(704)' with path: '/slave(704)/monitor/statistics.json'
> I0224 01:10:37.613068 28892 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
> I0224 01:10:37.616667 28880 slave.cpp:803] Agent terminating
> [       OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/1 (31 ms)
> [ RUN      ] Endpoint/SlaveEndpointTest.AuthorizedRequest/2
> I0224 01:10:37.627491 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
> W0224 01:10:37.628049 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
> W0224 01:10:37.628170 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
> I0224 01:10:37.628218 28861 provisioner.cpp:249] Using default backend 'copy'
> I0224 01:10:37.631695 28894 slave.cpp:211] Mesos agent started on (705)@172.17.0.3:57391
> I0224 01:10:37.631814 28894 slave.cpp:212] 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_PhBQMa/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_PhBQMa/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_PhBQMa/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_PhBQMa" --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_kJIbfo"
> I0224 01:10:37.632803 28894 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_PhBQMa/credential'
> I0224 01:10:37.633015 28894 slave.cpp:354] Agent using credential for: test-principal
> I0224 01:10:37.633052 28894 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_PhBQMa/http_credentials'
> I0224 01:10:37.633422 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
> I0224 01:10:37.633579 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
> I0224 01:10:37.635062 28894 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
> I0224 01:10:37.635162 28894 slave.cpp:549] Agent attributes: [  ]
> I0224 01:10:37.635180 28894 slave.cpp:554] Agent hostname: 9dd6373ba1f4
> I0224 01:10:37.635344 28885 status_update_manager.cpp:177] Pausing sending status updates
> I0224 01:10:37.636610 28883 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_AuthorizedRequest_2_kJIbfo/meta'
> I0224 01:10:37.636945 28880 status_update_manager.cpp:203] Recovering status update manager
> I0224 01:10:37.637228 28889 containerizer.cpp:599] Recovering containerizer
> I0224 01:10:37.638520 28885 provisioner.cpp:410] Provisioner recovery complete
> I0224 01:10:37.638943 28889 slave.cpp:5559] Finished recovery
> I0224 01:10:37.639472 28889 slave.cpp:5733] Querying resource estimator for oversubscribable resources
> I0224 01:10:37.639710 28892 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
> I0224 01:10:37.642117 28886 process.cpp:3704] Handling HTTP event for process 'slave(705)' with path: '/slave(705)/containers'
> I0224 01:10:37.643296 28881 http.cpp:885] Authorizing principal 'test-principal' to GET the '/containers' endpoint
> I0224 01:10:37.646500 28887 slave.cpp:803] Agent terminating
> [       OK ] Endpoint/SlaveEndpointTest.AuthorizedRequest/2 (29 ms)
> [ RUN      ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/0
> I0224 01:10:37.656749 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
> W0224 01:10:37.657274 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
> W0224 01:10:37.657387 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
> I0224 01:10:37.657451 28861 provisioner.cpp:249] Using default backend 'copy'
> I0224 01:10:37.660540 28885 slave.cpp:211] Mesos agent started on (706)@172.17.0.3:57391
> I0224 01:10:37.660595 28885 slave.cpp:212] 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_BjBRdj/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_BjBRdj/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_BjBRdj/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_BjBRdj" --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_nRUpBw"
> I0224 01:10:37.661310 28885 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_BjBRdj/credential'
> I0224 01:10:37.661489 28885 slave.cpp:354] Agent using credential for: test-principal
> I0224 01:10:37.661515 28885 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_BjBRdj/http_credentials'
> I0224 01:10:37.661803 28885 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
> I0224 01:10:37.661965 28885 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
> I0224 01:10:37.663514 28885 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
> I0224 01:10:37.663616 28885 slave.cpp:549] Agent attributes: [  ]
> I0224 01:10:37.663633 28885 slave.cpp:554] Agent hostname: 9dd6373ba1f4
> I0224 01:10:37.663806 28892 status_update_manager.cpp:177] Pausing sending status updates
> I0224 01:10:37.665499 28880 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_0_nRUpBw/meta'
> I0224 01:10:37.665721 28879 status_update_manager.cpp:203] Recovering status update manager
> I0224 01:10:37.666121 28882 containerizer.cpp:599] Recovering containerizer
> I0224 01:10:37.667600 28892 provisioner.cpp:410] Provisioner recovery complete
> I0224 01:10:37.668023 28889 slave.cpp:5559] Finished recovery
> I0224 01:10:37.668529 28889 slave.cpp:5733] Querying resource estimator for oversubscribable resources
> I0224 01:10:37.668881 28893 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
> I0224 01:10:37.671102 28892 process.cpp:3704] Handling HTTP event for process 'slave(706)' with path: '/slave(706)/monitor/statistics'
> I0224 01:10:37.672535 28888 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
> I0224 01:10:37.675073 28886 slave.cpp:803] Agent terminating
> [       OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/0 (29 ms)
> [ RUN      ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/1
> I0224 01:10:37.686686 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
> W0224 01:10:37.687245 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
> W0224 01:10:37.687358 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
> I0224 01:10:37.687397 28861 provisioner.cpp:249] Using default backend 'copy'
> I0224 01:10:37.691396 28894 slave.cpp:211] Mesos agent started on (707)@172.17.0.3:57391
> I0224 01:10:37.691447 28894 slave.cpp:212] 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_INI7Xr/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_INI7Xr/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_INI7Xr/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_INI7Xr" --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_kwVPgF"
> I0224 01:10:37.692136 28894 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_INI7Xr/credential'
> I0224 01:10:37.692313 28894 slave.cpp:354] Agent using credential for: test-principal
> I0224 01:10:37.692347 28894 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_INI7Xr/http_credentials'
> I0224 01:10:37.692679 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
> I0224 01:10:37.692824 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
> I0224 01:10:37.694669 28894 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
> I0224 01:10:37.694774 28894 slave.cpp:549] Agent attributes: [  ]
> I0224 01:10:37.694800 28894 slave.cpp:554] Agent hostname: 9dd6373ba1f4
> I0224 01:10:37.695000 28893 status_update_manager.cpp:177] Pausing sending status updates
> I0224 01:10:37.696518 28890 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_1_kwVPgF/meta'
> I0224 01:10:37.696867 28880 status_update_manager.cpp:203] Recovering status update manager
> I0224 01:10:37.697351 28886 containerizer.cpp:599] Recovering containerizer
> I0224 01:10:37.699077 28879 provisioner.cpp:410] Provisioner recovery complete
> I0224 01:10:37.699513 28880 slave.cpp:5559] Finished recovery
> I0224 01:10:37.700151 28880 slave.cpp:5733] Querying resource estimator for oversubscribable resources
> I0224 01:10:37.700419 28893 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
> I0224 01:10:37.703001 28892 process.cpp:3704] Handling HTTP event for process 'slave(707)' with path: '/slave(707)/monitor/statistics.json'
> I0224 01:10:37.704497 28879 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
> I0224 01:10:37.707386 28889 slave.cpp:803] Agent terminating
> [       OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/1 (32 ms)
> [ RUN      ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/2
> I0224 01:10:37.718793 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
> W0224 01:10:37.719359 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
> W0224 01:10:37.719476 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
> I0224 01:10:37.719527 28861 provisioner.cpp:249] Using default backend 'copy'
> I0224 01:10:37.722915 28894 slave.cpp:211] Mesos agent started on (708)@172.17.0.3:57391
> I0224 01:10:37.722955 28894 slave.cpp:212] 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_g2A32A/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_g2A32A/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_g2A32A/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_g2A32A" --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_5TqzgO"
> I0224 01:10:37.723620 28894 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_g2A32A/credential'
> I0224 01:10:37.723808 28894 slave.cpp:354] Agent using credential for: test-principal
> I0224 01:10:37.723835 28894 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_g2A32A/http_credentials'
> I0224 01:10:37.724117 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
> I0224 01:10:37.724284 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
> I0224 01:10:37.726049 28894 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
> I0224 01:10:37.726151 28894 slave.cpp:549] Agent attributes: [  ]
> I0224 01:10:37.726169 28894 slave.cpp:554] Agent hostname: 9dd6373ba1f4
> I0224 01:10:37.726307 28893 status_update_manager.cpp:177] Pausing sending status updates
> I0224 01:10:37.727744 28884 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_UnauthorizedRequest_2_5TqzgO/meta'
> I0224 01:10:37.728090 28887 status_update_manager.cpp:203] Recovering status update manager
> I0224 01:10:37.728317 28889 containerizer.cpp:599] Recovering containerizer
> I0224 01:10:37.729979 28882 provisioner.cpp:410] Provisioner recovery complete
> I0224 01:10:37.730438 28886 slave.cpp:5559] Finished recovery
> I0224 01:10:37.730985 28886 slave.cpp:5733] Querying resource estimator for oversubscribable resources
> I0224 01:10:37.731300 28894 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
> I0224 01:10:37.733644 28893 process.cpp:3704] Handling HTTP event for process 'slave(708)' with path: '/slave(708)/containers'
> I0224 01:10:37.734948 28888 http.cpp:885] Authorizing principal 'test-principal' to GET the '/containers' endpoint
> I0224 01:10:37.737732 28883 slave.cpp:803] Agent terminating
> [       OK ] Endpoint/SlaveEndpointTest.UnauthorizedRequest/2 (30 ms)
> [ RUN      ] Endpoint/SlaveEndpointTest.NoAuthorizer/0
> I0224 01:10:37.749266 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
> W0224 01:10:37.749868 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
> W0224 01:10:37.749980 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
> I0224 01:10:37.750030 28861 provisioner.cpp:249] Using default backend 'copy'
> I0224 01:10:37.752073 28861 cluster.cpp:446] Creating default 'local' authorizer
> I0224 01:10:37.753821 28894 slave.cpp:211] Mesos agent started on (709)@172.17.0.3:57391
> I0224 01:10:37.753870 28894 slave.cpp:212] 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_Kv9GrK/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_Kv9GrK/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_Kv9GrK/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_Kv9GrK" --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_5S4jAX"
> I0224 01:10:37.754535 28894 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_Kv9GrK/credential'
> I0224 01:10:37.754701 28894 slave.cpp:354] Agent using credential for: test-principal
> I0224 01:10:37.754729 28894 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_Kv9GrK/http_credentials'
> I0224 01:10:37.754981 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
> I0224 01:10:37.755126 28894 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
> I0224 01:10:37.756851 28894 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
> I0224 01:10:37.756952 28894 slave.cpp:549] Agent attributes: [  ]
> I0224 01:10:37.756969 28894 slave.cpp:554] Agent hostname: 9dd6373ba1f4
> I0224 01:10:37.757191 28892 status_update_manager.cpp:177] Pausing sending status updates
> I0224 01:10:37.758705 28879 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_0_5S4jAX/meta'
> I0224 01:10:37.759011 28884 status_update_manager.cpp:203] Recovering status update manager
> I0224 01:10:37.759387 28882 containerizer.cpp:599] Recovering containerizer
> I0224 01:10:37.761096 28891 provisioner.cpp:410] Provisioner recovery complete
> I0224 01:10:37.761623 28886 slave.cpp:5559] Finished recovery
> I0224 01:10:37.762140 28886 slave.cpp:5733] Querying resource estimator for oversubscribable resources
> I0224 01:10:37.762481 28879 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
> I0224 01:10:37.764935 28887 process.cpp:3704] Handling HTTP event for process 'slave(709)' with path: '/slave(709)/monitor/statistics'
> I0224 01:10:37.766314 28885 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics' endpoint
> I0224 01:10:37.770947 28891 slave.cpp:803] Agent terminating
> [       OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/0 (33 ms)
> [ RUN      ] Endpoint/SlaveEndpointTest.NoAuthorizer/1
> I0224 01:10:37.782487 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
> W0224 01:10:37.783035 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
> W0224 01:10:37.783149 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
> I0224 01:10:37.783188 28861 provisioner.cpp:249] Using default backend 'copy'
> I0224 01:10:37.785655 28861 cluster.cpp:446] Creating default 'local' authorizer
> I0224 01:10:37.787626 28887 slave.cpp:211] Mesos agent started on (710)@172.17.0.3:57391
> I0224 01:10:37.787678 28887 slave.cpp:212] 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_IwGzbU/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_IwGzbU/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_IwGzbU/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IwGzbU" --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_D5iOe7"
> I0224 01:10:37.788359 28887 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IwGzbU/credential'
> I0224 01:10:37.788559 28887 slave.cpp:354] Agent using credential for: test-principal
> I0224 01:10:37.788604 28887 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_IwGzbU/http_credentials'
> I0224 01:10:37.788933 28887 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
> I0224 01:10:37.789100 28887 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
> I0224 01:10:37.790766 28887 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
> I0224 01:10:37.790868 28887 slave.cpp:549] Agent attributes: [  ]
> I0224 01:10:37.790886 28887 slave.cpp:554] Agent hostname: 9dd6373ba1f4
> I0224 01:10:37.791034 28886 status_update_manager.cpp:177] Pausing sending status updates
> I0224 01:10:37.792815 28882 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_1_D5iOe7/meta'
> I0224 01:10:37.793119 28892 status_update_manager.cpp:203] Recovering status update manager
> I0224 01:10:37.793375 28880 containerizer.cpp:599] Recovering containerizer
> I0224 01:10:37.794988 28880 provisioner.cpp:410] Provisioner recovery complete
> I0224 01:10:37.795567 28894 slave.cpp:5559] Finished recovery
> I0224 01:10:37.796197 28894 slave.cpp:5733] Querying resource estimator for oversubscribable resources
> I0224 01:10:37.796483 28886 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
> I0224 01:10:37.799302 28889 process.cpp:3704] Handling HTTP event for process 'slave(710)' with path: '/slave(710)/monitor/statistics.json'
> I0224 01:10:37.800845 28892 http.cpp:885] Authorizing principal 'test-principal' to GET the '/monitor/statistics.json' endpoint
> I0224 01:10:37.804801 28885 slave.cpp:803] Agent terminating
> [       OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/1 (33 ms)
> [ RUN      ] Endpoint/SlaveEndpointTest.NoAuthorizer/2
> I0224 01:10:37.816818 28861 containerizer.cpp:220] Using isolation: posix/cpu,posix/mem,filesystem/posix,network/cni
> W0224 01:10:37.817299 28861 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
> W0224 01:10:37.817411 28861 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
> I0224 01:10:37.817453 28861 provisioner.cpp:249] Using default backend 'copy'
> I0224 01:10:37.818953 28861 cluster.cpp:446] Creating default 'local' authorizer
> I0224 01:10:37.820710 28893 slave.cpp:211] Mesos agent started on (711)@172.17.0.3:57391
> I0224 01:10:37.820762 28893 slave.cpp:212] 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_QnHIh4/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_QnHIh4/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_QnHIh4/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.3.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --qos_correction_interval_min="0ns" --quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_QnHIh4" --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_L6Pmfh"
> I0224 01:10:37.821667 28893 credentials.hpp:86] Loading credential for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_QnHIh4/credential'
> I0224 01:10:37.821854 28893 slave.cpp:354] Agent using credential for: test-principal
> I0224 01:10:37.821882 28893 credentials.hpp:37] Loading credentials for authentication from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_QnHIh4/http_credentials'
> I0224 01:10:37.822144 28893 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
> I0224 01:10:37.822294 28893 http.cpp:933] Using default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
> I0224 01:10:37.823861 28893 slave.cpp:541] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
> I0224 01:10:37.823969 28893 slave.cpp:549] Agent attributes: [  ]
> I0224 01:10:37.823999 28893 slave.cpp:554] Agent hostname: 9dd6373ba1f4
> I0224 01:10:37.824177 28890 status_update_manager.cpp:177] Pausing sending status updates
> I0224 01:10:37.825611 28889 state.cpp:62] Recovering state from '/tmp/Endpoint_SlaveEndpointTest_NoAuthorizer_2_L6Pmfh/meta'
> I0224 01:10:37.825848 28881 status_update_manager.cpp:203] Recovering status update manager
> I0224 01:10:37.826079 28883 containerizer.cpp:599] Recovering containerizer
> I0224 01:10:37.827441 28886 provisioner.cpp:410] Provisioner recovery complete
> I0224 01:10:37.827896 28883 slave.cpp:5559] Finished recovery
> I0224 01:10:37.828443 28883 slave.cpp:5733] Querying resource estimator for oversubscribable resources
> I0224 01:10:37.828754 28887 slave.cpp:5747] Received oversubscribable resources {} from the resource estimator
> I0224 01:10:37.830690 28894 process.cpp:3704] Handling HTTP event for process 'slave(711)' with path: '/slave(711)/containers'
> I0224 01:10:37.831868 28884 http.cpp:885] Authorizing principal 'test-principal' to GET the '/containers' endpoint
> I0224 01:10:37.835711 28879 slave.cpp:803] Agent terminating
> [       OK ] Endpoint/SlaveEndpointTest.NoAuthorizer/2 (29 ms)
> [----------] 9 tests from Endpoint/SlaveEndpointTest (285 ms total)
> 
> [----------] Global test environment tear-down
> [==========] 1507 tests from 169 test cases ran. (422757 ms total)
> [  PASSED  ] 1506 tests.
> [  FAILED  ] 1 test, listed below:
> [  FAILED  ] OversubscriptionTest.RescindRevocableOfferWithIncreasedRevocable
> 
> 1 FAILED TEST
>  YOU HAVE 12 DISABLED TESTS
> 
> make[4]: *** [check-local] Error 1
> make[4]: Leaving directory `/mesos/mesos-1.3.0/_build/src'
> make[3]: *** [check-am] Error 2
> make[3]: Leaving directory `/mesos/mesos-1.3.0/_build/src'
> make[2]: *** [check] Error 2
> make[2]: Leaving directory `/mesos/mesos-1.3.0/_build/src'
> make[1]: *** [check-recursive] Error 1
> make[1]: Leaving directory `/mesos/mesos-1.3.0/_build'
> make: *** [distcheck] Error 1
> + docker rmi mesos-1487896046-21621
> Untagged: mesos-1487896046-21621:latest
> Deleted: sha256:2f9ff115b877a0fd5f765abd83e198caff9be2dd8182424bfc5834827eaf926c
> Deleted: sha256:5418a86f725c5de155f5354ed62399de4a13252ff171a7e6162ed0ea9b0503cd
> Deleted: sha256:b6f928ed526a57c876e50e2509b82eacb1287bba484bb14d841c708c76bd440c
> Deleted: sha256:2c1be6dcc89ed66f2d0ac288edaf5cbb0d1796290b83c1dd8c7e81ea24dda759
> Deleted: sha256:469de6c2cd25263014e02d150635cf508f3f74570da74f311b3646dc7e1c32d3
> Deleted: sha256:2923a378d8942f6cafe639ddc7a07aa8eb5a5d69fc0e0611b73b8aafaa0d94a1
> Deleted: sha256:453662ce314abec890ff9a63fa5b0ee853dfacfa431264a3ebb763520182b1f6
> Deleted: sha256:4d4f485458a10c777d6149a15ba68959e17f2d3cbc396a675c2e8f6df95fd3da
> Deleted: sha256:5d556172201e7ad6ff4e1d6507e74da34ff24b8c567a22935f8a5ec337f5693f
> Deleted: sha256:a323d91ea447d4faf3eafdb9a089d57334d3b4ff22a3ed24a782c3fed3dd667a
> Deleted: sha256:06f8a6880dff91a5ddefc43ae5cae9945ba7cd9b023cc061d292835a35188351
> Deleted: sha256:fcc7de2e4bd7abbd208636d4f8c007dbd0a40c0aa23796c6cde32d35febd223b
> Deleted: sha256:d3a1512898a09eb215b590bcac4ff581cb82059815f958c58e6ea375e1f98b5b
> Deleted: sha256:a90459c84b0c7b9c9b260178ad4826a2ae3c6e6d81f793a84f47ac12eccd499b
> Deleted: sha256:4eb725cc015c5d17b95b0f6789e9f5eb8f5ee2ba672ae71876fdde6e37989800
> Deleted: sha256:1ddb9bc96d05268c1c6c256471db2db3cd82a4ae314a2416481062dbc4e2cbfe
> Deleted: sha256:c383161f7c48966bc0b55762783a70dccec04418d0dc3892edbff542deade1c6
> Deleted: sha256:02cd10a7627cc87bb134bae9adf258ba942aa96e96a3d0a5174fb7619586bdca
> Deleted: sha256:73d41f836cadd76970180375161461aff0fbbe09c6175c4d54bb6276e921e2e6
> Deleted: sha256:2a65a3c9cb33b6afe06a0697aad705e30e22c5ec0c4778da76ceb372405a0f57
> Deleted: sha256:77efebe9a99cfab69ed688163ce6467ec5d71f1bacd564d8c686bc280e8aaa22
> Deleted: sha256:843aeb604fe15dac54645aa8bb7a749823a6d4e45c4023f6cf1ed06dff25059a
> Deleted: sha256:f65a3d8818436adb6fcb0b6e2af43570e684e91626439bc779661a7fd8140fda
> Deleted: sha256:c06d99e71539fed6865a0dfeb3f4e1c120f570d389a8047156c05cebd3726d50
> Build step 'Execute shell' marked build as failure



Jenkins build is back to normal : Mesos-Buildbot » autotools,clang,--verbose,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2) #3303

Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Mesos-Buildbot/BUILDTOOL=autotools,COMPILER=clang,CONFIGURATION=--verbose,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2)/3303/display/redirect?page=changes>