builder: fx-team_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0125 starttime: 1458174464.83 results: success (0) buildid: 20160316160909 builduid: 573eade897a04fed921165d343fd8025 revision: d31323858727fe06b28856e7f405485aeea3420f ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.828911) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.829533) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.829985) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ASGG6vEBxG/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners TMPDIR=/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.005351 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.855641) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.856209) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.874263) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.875006) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ASGG6vEBxG/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners TMPDIR=/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005291 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.926103) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.926435) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.926820) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:44.927115) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ASGG6vEBxG/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners TMPDIR=/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-03-16 17:27:44-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: 'archiver_client.py' 0K .......... . 100% 15.4M=0.001s 2016-03-16 17:27:45 (15.4 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.166078 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:45.109343) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:45.109669) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ASGG6vEBxG/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners TMPDIR=/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.029744 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:45.159264) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-16 17:27:45.159611) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev d31323858727fe06b28856e7f405485aeea3420f --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev d31323858727fe06b28856e7f405485aeea3420f --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ASGG6vEBxG/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners TMPDIR=/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-03-16 17:27:45,241 truncating revision to first 12 chars 2016-03-16 17:27:45,241 Setting DEBUG logging. 2016-03-16 17:27:45,241 attempt 1/10 2016-03-16 17:27:45,241 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/d31323858727?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-16 17:27:46,316 unpacking tar archive at: fx-team-d31323858727/testing/mozharness/ program finished with exit code 0 elapsedTime=1.504529 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-03-16 17:27:46.684319) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:46.684678) ========= echo d31323858727fe06b28856e7f405485aeea3420f in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'd31323858727fe06b28856e7f405485aeea3420f'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ASGG6vEBxG/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners TMPDIR=/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False d31323858727fe06b28856e7f405485aeea3420f program finished with exit code 0 elapsedTime=0.005214 script_repo_revision: 'd31323858727fe06b28856e7f405485aeea3420f' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:46.734382) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:46.734692) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-16 17:27:46.749022) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 2 secs) (at 2016-03-16 17:27:46.749324) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ASGG6vEBxG/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners TMPDIR=/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 17:27:46 INFO - MultiFileLogger online at 20160316 17:27:46 in /builds/slave/test 17:27:46 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 17:27:46 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:27:46 INFO - {'append_to_log': False, 17:27:46 INFO - 'base_work_dir': '/builds/slave/test', 17:27:46 INFO - 'blob_upload_branch': 'Fx-Team', 17:27:46 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:27:46 INFO - 'branch': 'Fx-Team', 17:27:46 INFO - 'buildbot_json_path': 'buildprops.json', 17:27:46 INFO - 'config_files': ('talos/mac_config.py',), 17:27:46 INFO - 'default_actions': ('clobber', 17:27:46 INFO - 'read-buildbot-config', 17:27:46 INFO - 'download-and-extract', 17:27:46 INFO - 'populate-webroot', 17:27:46 INFO - 'create-virtualenv', 17:27:46 INFO - 'install', 17:27:46 INFO - 'run-tests'), 17:27:46 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:27:46 INFO - 'download_minidump_stackwalk': True, 17:27:46 INFO - 'download_symbols': 'ondemand', 17:27:46 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:27:46 INFO - 'tooltool.py': '/tools/tooltool.py', 17:27:46 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:27:46 INFO - '/tools/misc-python/virtualenv.py')}, 17:27:46 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:27:46 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:27:46 INFO - 'installer_path': 'installer.exe', 17:27:46 INFO - 'log_level': 'info', 17:27:46 INFO - 'log_name': 'talos', 17:27:46 INFO - 'log_to_console': True, 17:27:46 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 17:27:46 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 17:27:46 INFO - 'opt_config_files': (), 17:27:46 INFO - 'pip_index': False, 17:27:46 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:27:46 INFO - 'cmd': ('bash', 17:27:46 INFO - '-c', 17:27:46 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:27:46 INFO - 'enabled': True, 17:27:46 INFO - 'halt_on_failure': False, 17:27:46 INFO - 'name': 'check_screen_resolution'},), 17:27:46 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 17:27:46 INFO - 'cmd': ('bash', 17:27:46 INFO - '-c', 17:27:46 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 17:27:46 INFO - 'enabled': True, 17:27:46 INFO - 'halt_on_failure': False, 17:27:46 INFO - 'name': 'check_screen_resolution'},), 17:27:46 INFO - 'run_cmd_checks_enabled': True, 17:27:46 INFO - 'sps_profile': False, 17:27:46 INFO - 'sps_profile_interval': 0, 17:27:46 INFO - 'suite': 'dromaeojs', 17:27:46 INFO - 'system_bits': '32', 17:27:46 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:27:46 INFO - 'title': 't-yosemite-r7-0125', 17:27:46 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:27:46 INFO - 'use_talos_json': True, 17:27:46 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:27:46 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:27:46 INFO - 'work_dir': 'build'} 17:27:46 INFO - ##### 17:27:46 INFO - ##### Running clobber step. 17:27:46 INFO - ##### 17:27:46 INFO - Running pre-action listener: _resource_record_pre_action 17:27:46 INFO - Running main action method: clobber 17:27:46 INFO - rmtree: /builds/slave/test/build 17:27:46 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:27:48 INFO - Running post-action listener: _resource_record_post_action 17:27:48 INFO - ##### 17:27:48 INFO - ##### Running read-buildbot-config step. 17:27:48 INFO - ##### 17:27:48 INFO - Running pre-action listener: _resource_record_pre_action 17:27:48 INFO - Running main action method: read_buildbot_config 17:27:48 INFO - Using buildbot properties: 17:27:48 INFO - { 17:27:48 INFO - "project": "", 17:27:48 INFO - "product": "firefox", 17:27:48 INFO - "script_repo_revision": "production", 17:27:48 INFO - "builddir": "fx-team_yosemite_r7_test-dromaeojs", 17:27:48 INFO - "repository": "", 17:27:48 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 fx-team talos dromaeojs", 17:27:48 INFO - "buildid": "20160316160909", 17:27:48 INFO - "pgo_build": "False", 17:27:48 INFO - "basedir": "/builds/slave/test", 17:27:48 INFO - "buildnumber": 510, 17:27:48 INFO - "slavename": "t-yosemite-r7-0125", 17:27:48 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 17:27:48 INFO - "platform": "yosemite_r7", 17:27:48 INFO - "scheduler": "tests-fx-team-macosx64-talos", 17:27:48 INFO - "branch": "fx-team", 17:27:48 INFO - "repo_path": "integration/fx-team", 17:27:48 INFO - "revision": "d31323858727fe06b28856e7f405485aeea3420f", 17:27:48 INFO - "stage_platform": "macosx64", 17:27:48 INFO - "builduid": "573eade897a04fed921165d343fd8025", 17:27:48 INFO - "slavebuilddir": "test" 17:27:48 INFO - } 17:27:48 INFO - Found installer url https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg. 17:27:48 INFO - Running post-action listener: _resource_record_post_action 17:27:48 INFO - ##### 17:27:48 INFO - ##### Running download-and-extract step. 17:27:48 INFO - ##### 17:27:48 INFO - Running pre-action listener: _resource_record_pre_action 17:27:48 INFO - Running main action method: download_and_extract 17:27:48 INFO - mkdir: /builds/slave/test/build/tests 17:27:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:48 INFO - https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json matches https://queue.taskcluster.net 17:27:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 17:27:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json 17:27:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 17:27:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json'}, attempt #1 17:27:50 INFO - Downloaded 1199 bytes. 17:27:50 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.mac.test_packages.json 17:27:50 INFO - Using the following test package requirements: 17:27:50 INFO - {u'common': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 17:27:50 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:27:50 INFO - u'firefox-48.0a1.en-US.mac.cppunittest.tests.zip'], 17:27:50 INFO - u'gtest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:27:50 INFO - u'firefox-48.0a1.en-US.mac.gtest.tests.zip'], 17:27:50 INFO - u'jittest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:27:50 INFO - u'jsshell-mac.zip'], 17:27:50 INFO - u'mochitest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:27:50 INFO - u'firefox-48.0a1.en-US.mac.mochitest.tests.zip'], 17:27:50 INFO - u'mozbase': [u'firefox-48.0a1.en-US.mac.common.tests.zip'], 17:27:50 INFO - u'reftest': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:27:50 INFO - u'firefox-48.0a1.en-US.mac.reftest.tests.zip'], 17:27:50 INFO - u'talos': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:27:50 INFO - u'firefox-48.0a1.en-US.mac.talos.tests.zip'], 17:27:50 INFO - u'web-platform': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:27:50 INFO - u'firefox-48.0a1.en-US.mac.web-platform.tests.zip'], 17:27:50 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.mac.common.tests.zip', 17:27:50 INFO - u'firefox-48.0a1.en-US.mac.xpcshell.tests.zip']} 17:27:50 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip'] for test suite category: common 17:27:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:50 INFO - https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 17:27:50 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:27:50 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:27:50 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:27:50 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 17:27:51 INFO - Downloaded 17854501 bytes. 17:27:51 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:27:51 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 17:27:54 INFO - Return code: 0 17:27:54 INFO - Downloading packages: [u'firefox-48.0a1.en-US.mac.common.tests.zip', u'firefox-48.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 17:27:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:54 INFO - https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 17:27:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:27:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:27:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip 17:27:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip'}, attempt #1 17:27:55 INFO - Downloaded 17854501 bytes. 17:27:55 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:27:55 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.common.tests.zip -d /builds/slave/test/build/tests 17:27:59 INFO - Return code: 0 17:27:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:59 INFO - https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 17:27:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 17:27:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip 17:27:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip 17:27:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip'}, attempt #1 17:28:01 INFO - Downloaded 10846462 bytes. 17:28:01 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:28:01 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.mac.talos.tests.zip -d /builds/slave/test/build/tests 17:28:01 INFO - Return code: 0 17:28:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:01 INFO - https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 17:28:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:28:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:28:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg 17:28:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg'}, attempt #1 17:28:04 INFO - Downloaded 111194310 bytes. 17:28:04 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:28:04 INFO - mkdir: /builds/slave/test/properties 17:28:04 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:28:04 INFO - Writing to file /builds/slave/test/properties/build_url 17:28:04 INFO - Contents: 17:28:04 INFO - build_url:https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg 17:28:05 INFO - Running post-action listener: _resource_record_post_action 17:28:05 INFO - Running post-action listener: set_extra_try_arguments 17:28:05 INFO - ##### 17:28:05 INFO - ##### Running populate-webroot step. 17:28:05 INFO - ##### 17:28:05 INFO - Running pre-action listener: _resource_record_pre_action 17:28:05 INFO - Running main action method: populate_webroot 17:28:05 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:28:05 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:28:05 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:28:05 INFO - '--tppagecycles', 17:28:05 INFO - '7'], 17:28:05 INFO - 'tests': ['tsvgm']}}, 17:28:05 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 17:28:05 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 17:28:05 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:28:05 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 17:28:05 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 17:28:05 INFO - 'tests': ['dromaeo_css', 'kraken']}, 17:28:05 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:28:05 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:28:05 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:28:05 INFO - 'talos_options': ['--e10s'], 17:28:05 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:28:05 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:28:05 INFO - 'tests': ['damp', 'tps']}, 17:28:05 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:28:05 INFO - 'talos_options': ['--e10s'], 17:28:05 INFO - 'tests': ['damp', 'tps']}, 17:28:05 INFO - 'g3': {'tests': ['dromaeo_dom']}, 17:28:05 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:28:05 INFO - 'other': {'tests': ['a11yr', 17:28:05 INFO - 'ts_paint', 17:28:05 INFO - 'tpaint', 17:28:05 INFO - 'sessionrestore', 17:28:05 INFO - 'sessionrestore_no_auto_restore', 17:28:05 INFO - 'tabpaint']}, 17:28:05 INFO - 'other-e10s': {'talos_options': ['--e10s'], 17:28:05 INFO - 'tests': ['a11yr', 17:28:05 INFO - 'ts_paint', 17:28:05 INFO - 'tpaint', 17:28:05 INFO - 'sessionrestore', 17:28:05 INFO - 'sessionrestore_no_auto_restore', 17:28:05 INFO - 'tabpaint']}, 17:28:05 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 17:28:05 INFO - 'tests': ['a11yr', 17:28:05 INFO - 'ts_paint', 17:28:05 INFO - 'tpaint', 17:28:05 INFO - 'sessionrestore', 17:28:05 INFO - 'sessionrestore_no_auto_restore', 17:28:05 INFO - 'tabpaint']}, 17:28:05 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 17:28:05 INFO - 'tests': ['a11yr', 17:28:05 INFO - 'ts_paint', 17:28:05 INFO - 'tpaint', 17:28:05 INFO - 'sessionrestore', 17:28:05 INFO - 'sessionrestore_no_auto_restore', 17:28:05 INFO - 'tabpaint']}, 17:28:05 INFO - 'other_l64': {'tests': ['a11yr', 17:28:05 INFO - 'ts_paint', 17:28:05 INFO - 'tpaint', 17:28:05 INFO - 'sessionrestore', 17:28:05 INFO - 'sessionrestore_no_auto_restore', 17:28:05 INFO - 'tabpaint']}, 17:28:05 INFO - 'other_nol64': {'tests': ['a11yr', 17:28:05 INFO - 'ts_paint', 17:28:05 INFO - 'tpaint', 17:28:05 INFO - 'sessionrestore', 17:28:05 INFO - 'sessionrestore_no_auto_restore', 17:28:05 INFO - 'tabpaint']}, 17:28:05 INFO - 'svgr': {'tests': ['tsvgx', 17:28:05 INFO - 'tsvgr_opacity', 17:28:05 INFO - 'tart', 17:28:05 INFO - 'tscrollx', 17:28:05 INFO - 'cart']}, 17:28:05 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 17:28:05 INFO - 'tests': ['tsvgx', 17:28:05 INFO - 'tsvgr_opacity', 17:28:05 INFO - 'tart', 17:28:05 INFO - 'tscrollx', 17:28:05 INFO - 'cart']}, 17:28:05 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:28:05 INFO - 'tests': ['tp5o']}, 17:28:05 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:28:05 INFO - 'talos_options': ['--e10s'], 17:28:05 INFO - 'tests': ['tp5o']}, 17:28:05 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:28:05 INFO - 'talos_options': ['--xperf_path', 17:28:05 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:28:05 INFO - 'tests': ['tp5n']}, 17:28:05 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:28:05 INFO - 'talos_options': ['--e10s', 17:28:05 INFO - '--xperf_path', 17:28:05 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:28:05 INFO - 'tests': ['tp5n']}}, 17:28:05 INFO - 'talos.zip': {'path': '', 17:28:05 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:28:05 INFO - Running post-action listener: _resource_record_post_action 17:28:05 INFO - ##### 17:28:05 INFO - ##### Running create-virtualenv step. 17:28:05 INFO - ##### 17:28:05 INFO - Running pre-action listener: _resource_record_pre_action 17:28:05 INFO - Running main action method: create_virtualenv 17:28:05 INFO - Creating virtualenv /builds/slave/test/build/venv 17:28:05 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 17:28:05 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:28:05 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:28:05 INFO - Using real prefix '/tools/python27' 17:28:05 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:28:06 INFO - Installing distribute.............................................................................................................................................................................................done. 17:28:09 INFO - Installing pip.................done. 17:28:09 INFO - Return code: 0 17:28:09 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:28:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107997a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10799f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff3094cdd90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:28:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 17:28:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 17:28:09 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:28:09 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:28:09 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:28:09 INFO - 'HOME': '/Users/cltbld', 17:28:09 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:28:09 INFO - 'LOGNAME': 'cltbld', 17:28:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:09 INFO - 'MOZ_NO_REMOTE': '1', 17:28:09 INFO - 'NO_EM_RESTART': '1', 17:28:09 INFO - 'PAGER': '/bin/cat', 17:28:09 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:28:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:09 INFO - 'PWD': '/builds/slave/test', 17:28:09 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:28:09 INFO - 'SHELL': '/bin/bash', 17:28:09 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:28:09 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:28:09 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:28:09 INFO - 'USER': 'cltbld', 17:28:09 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:28:09 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:28:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:09 INFO - 'XPC_FLAGS': '0x0', 17:28:09 INFO - 'XPC_SERVICE_NAME': '0', 17:28:09 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:28:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:09 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 17:28:09 INFO - Cleaning up... 17:28:09 INFO - Return code: 0 17:28:09 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 17:28:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107997a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10799f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff3094cdd90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:28:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 17:28:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 17:28:09 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:28:09 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:28:09 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:28:09 INFO - 'HOME': '/Users/cltbld', 17:28:09 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:28:09 INFO - 'LOGNAME': 'cltbld', 17:28:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:09 INFO - 'MOZ_NO_REMOTE': '1', 17:28:09 INFO - 'NO_EM_RESTART': '1', 17:28:09 INFO - 'PAGER': '/bin/cat', 17:28:09 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:28:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:09 INFO - 'PWD': '/builds/slave/test', 17:28:09 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:28:09 INFO - 'SHELL': '/bin/bash', 17:28:09 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:28:09 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:28:09 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:28:09 INFO - 'USER': 'cltbld', 17:28:09 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:28:09 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:28:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:09 INFO - 'XPC_FLAGS': '0x0', 17:28:09 INFO - 'XPC_SERVICE_NAME': '0', 17:28:09 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:28:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:09 INFO - Downloading/unpacking psutil>=0.7.1 17:28:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:28:12 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:28:12 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:28:12 INFO - Installing collected packages: psutil 17:28:12 INFO - Running setup.py install for psutil 17:28:12 INFO - building 'psutil._psutil_osx' extension 17:28:12 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_osx.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o 17:28:13 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/_psutil_common.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o 17:28:13 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -DPSUTIL_VERSION=311 -I/tools/python27/include/python2.7 -c psutil/arch/osx/process_info.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o 17:28:13 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_common.o build/temp.macosx-10.10-x86_64-2.7/psutil/arch/osx/process_info.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_osx.so -framework CoreFoundation -framework IOKit 17:28:13 INFO - building 'psutil._psutil_posix' extension 17:28:13 INFO - gcc -fno-strict-aliasing -g -O2 -DNDEBUG -g -fwrapv -O3 -Wall -Wstrict-prototypes -I/tools/python27/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o 17:28:13 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 17:28:13 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 17:28:13 INFO - ^ 17:28:13 INFO - 1 warning generated. 17:28:13 INFO - gcc -bundle -bundle_loader /tools/python27/bin/python2.7 build/temp.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.macosx-10.10-x86_64-2.7/psutil/_psutil_posix.so 17:28:13 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:28:13 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:28:13 INFO - Successfully installed psutil 17:28:13 INFO - Cleaning up... 17:28:13 INFO - Return code: 0 17:28:13 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 17:28:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:13 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107997a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10799f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff3094cdd90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:28:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 17:28:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 17:28:13 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:28:13 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:28:13 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:28:13 INFO - 'HOME': '/Users/cltbld', 17:28:13 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:28:13 INFO - 'LOGNAME': 'cltbld', 17:28:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:13 INFO - 'MOZ_NO_REMOTE': '1', 17:28:13 INFO - 'NO_EM_RESTART': '1', 17:28:13 INFO - 'PAGER': '/bin/cat', 17:28:13 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:28:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:13 INFO - 'PWD': '/builds/slave/test', 17:28:13 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:28:13 INFO - 'SHELL': '/bin/bash', 17:28:13 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:28:13 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:28:13 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:28:13 INFO - 'USER': 'cltbld', 17:28:13 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:28:13 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:28:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:13 INFO - 'XPC_FLAGS': '0x0', 17:28:13 INFO - 'XPC_SERVICE_NAME': '0', 17:28:13 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:28:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:14 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 17:28:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:16 INFO - Downloading mozsystemmonitor-0.0.tar.gz 17:28:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:28:16 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 17:28:16 INFO - Installing collected packages: mozsystemmonitor 17:28:16 INFO - Running setup.py install for mozsystemmonitor 17:28:16 INFO - Successfully installed mozsystemmonitor 17:28:16 INFO - Cleaning up... 17:28:16 INFO - Return code: 0 17:28:16 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:28:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107997a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10799f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff3094cdd90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:28:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 17:28:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 17:28:16 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:28:16 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:28:16 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:28:16 INFO - 'HOME': '/Users/cltbld', 17:28:16 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:28:16 INFO - 'LOGNAME': 'cltbld', 17:28:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:16 INFO - 'MOZ_NO_REMOTE': '1', 17:28:16 INFO - 'NO_EM_RESTART': '1', 17:28:16 INFO - 'PAGER': '/bin/cat', 17:28:16 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:28:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:16 INFO - 'PWD': '/builds/slave/test', 17:28:16 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:28:16 INFO - 'SHELL': '/bin/bash', 17:28:16 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:28:16 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:28:16 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:28:16 INFO - 'USER': 'cltbld', 17:28:16 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:28:16 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:28:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:16 INFO - 'XPC_FLAGS': '0x0', 17:28:16 INFO - 'XPC_SERVICE_NAME': '0', 17:28:16 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:28:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:17 INFO - Downloading/unpacking blobuploader==1.2.4 17:28:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:19 INFO - Downloading blobuploader-1.2.4.tar.gz 17:28:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:28:19 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:28:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:28:20 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:28:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:20 INFO - Downloading docopt-0.6.1.tar.gz 17:28:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:28:20 INFO - Installing collected packages: blobuploader, requests, docopt 17:28:20 INFO - Running setup.py install for blobuploader 17:28:20 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:28:20 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:28:20 INFO - Running setup.py install for requests 17:28:21 INFO - Running setup.py install for docopt 17:28:21 INFO - Successfully installed blobuploader requests docopt 17:28:21 INFO - Cleaning up... 17:28:21 INFO - Return code: 0 17:28:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:28:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107997a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10799f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff3094cdd90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:28:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 17:28:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:28:21 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:28:21 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:28:21 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:28:21 INFO - 'HOME': '/Users/cltbld', 17:28:21 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:28:21 INFO - 'LOGNAME': 'cltbld', 17:28:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:21 INFO - 'MOZ_NO_REMOTE': '1', 17:28:21 INFO - 'NO_EM_RESTART': '1', 17:28:21 INFO - 'PAGER': '/bin/cat', 17:28:21 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:28:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:21 INFO - 'PWD': '/builds/slave/test', 17:28:21 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:28:21 INFO - 'SHELL': '/bin/bash', 17:28:21 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:28:21 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:28:21 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:28:21 INFO - 'USER': 'cltbld', 17:28:21 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:28:21 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:28:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:21 INFO - 'XPC_FLAGS': '0x0', 17:28:21 INFO - 'XPC_SERVICE_NAME': '0', 17:28:21 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:28:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:28:21 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-coIkmz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:28:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:28:21 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-xZcla4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-tHnj1u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-e2VCIg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-CBE4Ny-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-IAXFme-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-UDMHJ6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-JYyEQs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-gHAXrp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-72LUp1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-qvuP5t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:28:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:28:22 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-6_cPel-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:28:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:28:23 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-oaskAv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:28:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:28:23 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-hOfYkp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:28:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:28:23 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-hDx_Ll-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:28:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:28:23 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-ibJdQ5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:28:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:28:23 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-PuG8CF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:28:23 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:28:23 INFO - Running setup.py install for manifestparser 17:28:23 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:28:23 INFO - Running setup.py install for mozcrash 17:28:23 INFO - Running setup.py install for mozdebug 17:28:23 INFO - Running setup.py install for mozdevice 17:28:24 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 17:28:24 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:28:24 INFO - Running setup.py install for mozfile 17:28:24 INFO - Running setup.py install for mozhttpd 17:28:24 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:28:24 INFO - Running setup.py install for mozinfo 17:28:24 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:28:24 INFO - Running setup.py install for mozInstall 17:28:24 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:28:24 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:28:24 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:28:24 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:28:24 INFO - Running setup.py install for mozleak 17:28:24 INFO - Running setup.py install for mozlog 17:28:25 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:28:25 INFO - Running setup.py install for moznetwork 17:28:25 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:28:25 INFO - Running setup.py install for mozprocess 17:28:25 INFO - Running setup.py install for mozprofile 17:28:25 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:28:25 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:28:25 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:28:25 INFO - Running setup.py install for mozrunner 17:28:25 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:28:25 INFO - Running setup.py install for mozscreenshot 17:28:25 INFO - Running setup.py install for moztest 17:28:25 INFO - Running setup.py install for mozversion 17:28:26 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:28:26 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:28:26 INFO - Cleaning up... 17:28:26 INFO - Return code: 0 17:28:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:28:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107997a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10799f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff3094cdd90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:28:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 17:28:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:28:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:28:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:28:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:28:26 INFO - 'HOME': '/Users/cltbld', 17:28:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:28:26 INFO - 'LOGNAME': 'cltbld', 17:28:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:26 INFO - 'MOZ_NO_REMOTE': '1', 17:28:26 INFO - 'NO_EM_RESTART': '1', 17:28:26 INFO - 'PAGER': '/bin/cat', 17:28:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:28:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:26 INFO - 'PWD': '/builds/slave/test', 17:28:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:28:26 INFO - 'SHELL': '/bin/bash', 17:28:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:28:26 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:28:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:28:26 INFO - 'USER': 'cltbld', 17:28:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:28:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:28:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:26 INFO - 'XPC_FLAGS': '0x0', 17:28:26 INFO - 'XPC_SERVICE_NAME': '0', 17:28:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:28:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:28:26 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-ctyxQt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:28:26 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 17:28:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:28:26 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-mVBcb9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:28:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:28:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:28:26 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-sHGh8a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:28:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:28:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:28:26 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-FWfdgu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:28:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:28:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:28:26 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-lYLN8M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:28:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 17:28:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:28:26 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-mw8icE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:28:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 17:28:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:28:26 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-qbEwJA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:28:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 17:28:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:28:27 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-Kzpt2H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:28:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 17:28:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:28:27 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-eoYv1Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:28:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 17:28:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:28:27 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-tMzkLY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:28:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:28:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:28:27 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-o3YDNq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:28:27 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 17:28:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:28:27 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-3loqxr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:28:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 17:28:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:28:27 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-rd5Hmv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:28:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 17:28:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:28:27 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-iiHAnv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:28:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 17:28:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:28:27 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-WqQqfT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:28:27 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 17:28:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:28:27 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-lbWabA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:28:28 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 17:28:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:28:28 INFO - Running setup.py (path:/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/pip-TvDzJZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:28:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 17:28:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:28:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:28:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 17:28:28 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:28:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 17:28:28 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:28:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:30 INFO - Downloading blessings-1.6.tar.gz 17:28:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:28:30 INFO - Installing collected packages: blessings 17:28:30 INFO - Running setup.py install for blessings 17:28:30 INFO - Successfully installed blessings 17:28:30 INFO - Cleaning up... 17:28:31 INFO - Return code: 0 17:28:31 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:28:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:28:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:28:31 INFO - Reading from file tmpfile_stdout 17:28:31 INFO - Current package versions: 17:28:31 INFO - blessings == 1.6 17:28:31 INFO - blobuploader == 1.2.4 17:28:31 INFO - docopt == 0.6.1 17:28:31 INFO - manifestparser == 1.1 17:28:31 INFO - mozInstall == 1.12 17:28:31 INFO - mozcrash == 0.17 17:28:31 INFO - mozdebug == 0.1 17:28:31 INFO - mozdevice == 0.48 17:28:31 INFO - mozfile == 1.2 17:28:31 INFO - mozhttpd == 0.7 17:28:31 INFO - mozinfo == 0.9 17:28:31 INFO - mozleak == 0.1 17:28:31 INFO - mozlog == 3.1 17:28:31 INFO - moznetwork == 0.27 17:28:31 INFO - mozprocess == 0.22 17:28:31 INFO - mozprofile == 0.28 17:28:31 INFO - mozrunner == 6.11 17:28:31 INFO - mozscreenshot == 0.1 17:28:31 INFO - mozsystemmonitor == 0.0 17:28:31 INFO - moztest == 0.7 17:28:31 INFO - mozversion == 1.4 17:28:31 INFO - psutil == 3.1.1 17:28:31 INFO - requests == 1.2.3 17:28:31 INFO - wsgiref == 0.1.2 17:28:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:28:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107997a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10799f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff3094cdd90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:28:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 17:28:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 17:28:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:28:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:28:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:28:31 INFO - 'HOME': '/Users/cltbld', 17:28:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:28:31 INFO - 'LOGNAME': 'cltbld', 17:28:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:31 INFO - 'MOZ_NO_REMOTE': '1', 17:28:31 INFO - 'NO_EM_RESTART': '1', 17:28:31 INFO - 'PAGER': '/bin/cat', 17:28:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:28:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:31 INFO - 'PWD': '/builds/slave/test', 17:28:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:28:31 INFO - 'SHELL': '/bin/bash', 17:28:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:28:31 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:28:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:28:31 INFO - 'USER': 'cltbld', 17:28:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:28:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:28:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:31 INFO - 'XPC_FLAGS': '0x0', 17:28:31 INFO - 'XPC_SERVICE_NAME': '0', 17:28:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:28:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 17:28:31 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 17:28:31 INFO - Cleaning up... 17:28:31 INFO - Return code: 0 17:28:31 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 17:28:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107997a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10799f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff3094cdd90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:28:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 17:28:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 17:28:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:28:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:28:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:28:31 INFO - 'HOME': '/Users/cltbld', 17:28:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:28:31 INFO - 'LOGNAME': 'cltbld', 17:28:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:31 INFO - 'MOZ_NO_REMOTE': '1', 17:28:31 INFO - 'NO_EM_RESTART': '1', 17:28:31 INFO - 'PAGER': '/bin/cat', 17:28:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:28:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:31 INFO - 'PWD': '/builds/slave/test', 17:28:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:28:31 INFO - 'SHELL': '/bin/bash', 17:28:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:28:31 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:28:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:28:31 INFO - 'USER': 'cltbld', 17:28:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:28:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:28:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:31 INFO - 'XPC_FLAGS': '0x0', 17:28:31 INFO - 'XPC_SERVICE_NAME': '0', 17:28:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:28:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:31 INFO - Downloading/unpacking jsonschema 17:28:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:34 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:28:34 INFO - Downloading/unpacking functools32 (from jsonschema) 17:28:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:34 INFO - Downloading functools32-3.2.3-2.tar.gz 17:28:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 17:28:34 INFO - warning: no files found matching '*.txt' 17:28:34 INFO - no previously-included directories found matching 'build' 17:28:34 INFO - no previously-included directories found matching 'dist' 17:28:34 INFO - no previously-included directories found matching '.git*' 17:28:34 INFO - Installing collected packages: jsonschema, functools32 17:28:34 INFO - Running setup.py install for functools32 17:28:34 INFO - warning: no files found matching '*.txt' 17:28:34 INFO - no previously-included directories found matching 'build' 17:28:34 INFO - no previously-included directories found matching 'dist' 17:28:34 INFO - no previously-included directories found matching '.git*' 17:28:34 INFO - Successfully installed jsonschema functools32 17:28:34 INFO - Cleaning up... 17:28:34 INFO - Return code: 0 17:28:34 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 17:28:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x107997a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10799f4c8>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7ff3094cdd90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 'VERSIONER_PYTHON_VERSION': '2.7', 'XPC_FLAGS': '0x0', 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 'MOZ_NO_REMOTE': '1', 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 17:28:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 17:28:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 17:28:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:28:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:28:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:28:34 INFO - 'HOME': '/Users/cltbld', 17:28:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:28:34 INFO - 'LOGNAME': 'cltbld', 17:28:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:34 INFO - 'MOZ_NO_REMOTE': '1', 17:28:34 INFO - 'NO_EM_RESTART': '1', 17:28:34 INFO - 'PAGER': '/bin/cat', 17:28:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:28:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:34 INFO - 'PWD': '/builds/slave/test', 17:28:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:28:34 INFO - 'SHELL': '/bin/bash', 17:28:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:28:34 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:28:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:28:34 INFO - 'USER': 'cltbld', 17:28:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:28:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:28:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:34 INFO - 'XPC_FLAGS': '0x0', 17:28:34 INFO - 'XPC_SERVICE_NAME': '0', 17:28:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:28:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:35 INFO - Downloading/unpacking flake8 17:28:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:37 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 17:28:37 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 17:28:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:37 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 17:28:37 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 17:28:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:38 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 17:28:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:28:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:28:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:28:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 17:28:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:28:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:28:38 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:28:38 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:28:38 INFO - no previously-included directories found matching 'docs/_build' 17:28:38 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 17:28:39 INFO - Running setup.py install for pep8 17:28:39 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:28:39 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:28:39 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:28:39 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:28:39 INFO - no previously-included directories found matching 'docs/_build' 17:28:39 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 17:28:39 INFO - Successfully installed flake8 mccabe pyflakes pep8 17:28:39 INFO - Cleaning up... 17:28:39 INFO - Return code: 0 17:28:39 INFO - Running post-action listener: _resource_record_post_action 17:28:39 INFO - Running post-action listener: _start_resource_monitoring 17:28:39 INFO - Starting resource monitoring. 17:28:39 INFO - ##### 17:28:39 INFO - ##### Running install step. 17:28:39 INFO - ##### 17:28:39 INFO - Running pre-action listener: _resource_record_pre_action 17:28:39 INFO - Running main action method: install 17:28:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:28:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:28:39 INFO - Reading from file tmpfile_stdout 17:28:39 INFO - Detecting whether we're running mozinstall >=1.0... 17:28:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:28:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:28:39 INFO - Reading from file tmpfile_stdout 17:28:39 INFO - Output received: 17:28:39 INFO - Usage: mozinstall [options] installer 17:28:39 INFO - Options: 17:28:39 INFO - -h, --help show this help message and exit 17:28:39 INFO - -d DEST, --destination=DEST 17:28:39 INFO - Directory to install application into. [default: 17:28:39 INFO - "/builds/slave/test"] 17:28:39 INFO - --app=APP Application being installed. [default: firefox] 17:28:39 INFO - mkdir: /builds/slave/test/build/application 17:28:39 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 17:28:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 17:29:13 INFO - Reading from file tmpfile_stdout 17:29:13 INFO - Output received: 17:29:13 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 17:29:13 INFO - Running post-action listener: _resource_record_post_action 17:29:13 INFO - ##### 17:29:13 INFO - ##### Running run-tests step. 17:29:13 INFO - ##### 17:29:13 INFO - Running pre-action listener: _resource_record_pre_action 17:29:13 INFO - Running main action method: run_tests 17:29:13 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 17:29:13 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 17:29:13 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 17:29:13 INFO - 2016-03-16 17:29:13.398 screenresolution[1641:7351] starting screenresolution argv=screenresolution get 17:29:13 INFO - 2016-03-16 17:29:13.400 screenresolution[1641:7351] Display 0: 1600x1200x32@60 17:29:13 INFO - 2016-03-16 17:29:13.406 screenresolution[1642:7353] starting screenresolution argv=screenresolution list 17:29:13 INFO - Available Modes on Display 0 17:29:13 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 17:29:13 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 17:29:13 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 17:29:13 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 17:29:13 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 17:29:13 INFO - Intel Iris: 17:29:13 INFO - Chipset Model: Intel Iris 17:29:13 INFO - Type: GPU 17:29:13 INFO - Bus: Built-In 17:29:13 INFO - VRAM (Dynamic, Max): 1536 MB 17:29:13 INFO - Vendor: Intel (0x8086) 17:29:13 INFO - Device ID: 0x0a2e 17:29:13 INFO - Revision ID: 0x0009 17:29:13 INFO - Displays: 17:29:13 INFO - Display: 17:29:13 INFO - Resolution: 1600 x 1200 @ 60 Hz 17:29:13 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 17:29:13 INFO - Display Serial Number: 1600x1200 60 17:29:13 INFO - Main Display: Yes 17:29:13 INFO - Mirror: Off 17:29:13 INFO - Online: Yes 17:29:13 INFO - Rotation: Supported 17:29:13 INFO - Return code: 0 17:29:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:29:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:29:13 INFO - Python 2.7.3 17:29:13 INFO - Return code: 0 17:29:13 INFO - grabbing minidump binary from tooltool 17:29:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:29:13 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10783bd30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10765fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x107832b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:29:13 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 17:29:13 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/macosx64/releng.manifest -o -c /builds/tooltool_cache 17:29:13 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:29:13 INFO - Return code: 0 17:29:13 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 17:29:13 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:29:13 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:29:13 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 17:29:13 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:29:13 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 17:29:13 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 17:29:14 INFO - Return code: 0 17:29:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0125', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 17:29:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0125 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 17:29:14 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.ASGG6vEBxG/Render', 17:29:14 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 17:29:14 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 17:29:14 INFO - 'HOME': '/Users/cltbld', 17:29:14 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 17:29:14 INFO - 'LOGNAME': 'cltbld', 17:29:14 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:29:14 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 17:29:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:29:14 INFO - 'MOZ_NO_REMOTE': '1', 17:29:14 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:29:14 INFO - 'NO_EM_RESTART': '1', 17:29:14 INFO - 'PAGER': '/bin/cat', 17:29:14 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 17:29:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:29:14 INFO - 'PWD': '/builds/slave/test', 17:29:14 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:29:14 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 17:29:14 INFO - 'SHELL': '/bin/bash', 17:29:14 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners', 17:29:14 INFO - 'TMPDIR': '/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/', 17:29:14 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 17:29:14 INFO - 'USER': 'cltbld', 17:29:14 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 17:29:14 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 17:29:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:29:14 INFO - 'XPC_FLAGS': '0x0', 17:29:14 INFO - 'XPC_SERVICE_NAME': '0', 17:29:14 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 17:29:14 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0125', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 17:29:15 INFO - mozversion application_buildid: 20160316160909 17:29:15 INFO - mozversion application_changeset: d31323858727fe06b28856e7f405485aeea3420f 17:29:15 INFO - mozversion application_display_name: Nightly 17:29:15 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:29:15 INFO - mozversion application_name: Firefox 17:29:15 INFO - mozversion application_remotingname: firefox 17:29:15 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 17:29:15 INFO - mozversion application_vendor: Mozilla 17:29:15 INFO - mozversion application_version: 48.0a1 17:29:15 INFO - mozversion platform_buildid: 20160316160909 17:29:15 INFO - mozversion platform_changeset: d31323858727fe06b28856e7f405485aeea3420f 17:29:15 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 17:29:15 INFO - mozversion platform_version: 48.0a1 17:29:15 INFO - using testdate: 1458174555 17:29:15 INFO - actual date: 1458174555 17:29:15 INFO - starting webserver on 'localhost:49271' 17:29:15 INFO - SUITE-START | Running 2 tests 17:29:15 INFO - TEST-START | dromaeo_css 17:29:15 INFO - operating with platform_type : mac_ 17:29:15 INFO - Initialising browser for dromaeo_css test... 17:29:15 INFO - TEST-INFO | started process 1660 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/tmpGWc3MA/profile http://localhost:49271/getInfo.html) 17:29:17 INFO - PROCESS | 1660 | __metrics Screen width/height:1600/1200 17:29:17 INFO - PROCESS | 1660 | colorDepth:24 17:29:17 INFO - PROCESS | 1660 | Browser inner width/height: 1024/689 17:29:17 INFO - PROCESS | 1660 | __metrics 17:29:17 INFO - PROCESS | 1660 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 17:29:17 ERROR - PROCESS | 1660 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 17:29:18 INFO - TEST-INFO | 1660: exit 0 17:29:18 INFO - Browser initialized. 17:29:18 INFO - Running cycle 1/1 for dromaeo_css test... 17:29:18 INFO - TEST-INFO | started process 1663 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/tmpGWc3MA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:29:30 INFO - PROCESS | 1663 | RSS: Main: 242749440 17:29:30 INFO - PROCESS | 1663 | 17:30:21 INFO - PROCESS | 1663 | 1458174621609 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 17:32:31 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49271/tests/dromaeo/cssquery-ext.html) 17:32:32 INFO - PROCESS | 1663 | RSS: Main: 337526784 17:32:32 INFO - PROCESS | 1663 | 17:35:35 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-ext.html (next: http://localhost:49271/tests/dromaeo/cssquery-jquery.html) 17:35:35 INFO - PROCESS | 1663 | RSS: Main: 374284288 17:35:35 INFO - PROCESS | 1663 | 17:38:37 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49271/tests/dromaeo/cssquery-mootools.html) 17:38:38 INFO - PROCESS | 1663 | RSS: Main: 370548736 17:38:38 INFO - PROCESS | 1663 | 17:41:40 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49271/tests/dromaeo/cssquery-prototype.html) 17:41:41 INFO - PROCESS | 1663 | RSS: Main: 329297920 17:41:41 INFO - PROCESS | 1663 | 17:44:44 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49271/tests/dromaeo/cssquery-yui.html) 17:44:44 INFO - PROCESS | 1663 | RSS: Main: 334389248 17:44:44 INFO - PROCESS | 1663 | 17:47:47 INFO - PROCESS | 1663 | Cycle 1(1): loaded http://localhost:49271/tests/dromaeo/cssquery-yui.html (next: http://localhost:49271/tests/dromaeo/cssquery-dojo.html) 17:47:47 INFO - PROCESS | 1663 | RSS: Main: 406589440 17:47:47 INFO - PROCESS | 1663 | 17:47:47 INFO - PROCESS | 1663 | __start_tp_report 17:47:47 INFO - PROCESS | 1663 | _x_x_mozilla_page_load 17:47:47 INFO - PROCESS | 1663 | _x_x_mozilla_page_load_details 17:47:47 INFO - PROCESS | 1663 | |i|pagename|runs| 17:47:47 INFO - PROCESS | 1663 | |0;dojo.html;3191.968080319197;3336.549565808615;3494.1963348429877;3496.566407772813;3558.341706784245;5406.864828379293;5528.5024347808685;5622.212890195371;5626.465485778845;5637.887242255158;5401.891962160755;5455.1271796512565;5469.890602187954;5471.042567550673;5484.808031718891;4966.404031516223;4984.800607975695;5023.296738456601;5088.0587091388215;5100.69395836251;5049.293098966147;5090.185570308751;5100.744962751866;5111.591072714193;5118.8464346069495;5016.749162541876;5035.748212589374;5062.215356619711;5074.3657042869645;5093.541581257686;5171.120909445403;5226.085435048852;5230.163173892197;5237.371515418136;5297.390800057966;5003.449620541737;5012.624053196025;5098.490150984909;5126.461721519224;5153.484651534854;5398.352197736258;5407.891842163135;5419.105847535152;5438.428964958662;5505.311836020457;6077.939220607782;6091.725872335755;6097.969510152465;6099.512039036867;6118.204633397674;6052.939470605282;6056.485198758067;6153.600015998945;6171.321154673027;6192.504599632019;5688.687122208318;5700.743466544015;5704.486596206279;5709.628874123168;5727.968965586193;6318.020706790455;6341.460975817107;6379.776707815204;6400.135981642512;6410.423061924449;5887.20522729426;5991;6049.274087109487;6061.72722227492;6118.265808102967;6158.097404281649;6177.135201071854;6213.409726076015;6215.440610345091;6224.968875155686;6145.354737752561;6147.323794382614;6154.169187159766;6173.444390004921;6177.073438984188;5919.4080591940465;6042.274927008787;6100.73256437228;6131.713108457284;6133.640713961371;4800.543948324904;4802.423709154924;4807.423109226846;4837.467878533358;4840.394950631171;4245.469316335458;4280.6789490788315;4321.6974811762875;4339.891502712458;4400.251957167289;5570.5543556516195;5591.776328946797;5661.490465858093;5704;5707.8858422832145;6207.6585787782105;6218.347073557302;6221.502279817604;6227.813165605039;6232.345603711636;5576.498115169654;5600.187972743929;5615.803446879421;5635.323761148688;5659.405762394889;4346.261135606955;4573.719358579603;5322.92015619766;5324.866878328073;5337.733113344318;6305.243370795534;6307.621542707452;6312.242530896322;6314.242290924934;6327.050942358683;6100.847478813065;6254.2807577129215;6255.906161407674;6286.057091436322;6296.275928268308;6268.185135932482;6307.810765677037;6309.558330916791;6320.810375688737;6337.588056776295;6051.878962420815;6072.362401947732;6076.210092687922;6080.513558915188;6097.024476083805;5989.670568118795;6157.199564056644;6162.445379915829;6212.4408803207925;6215.9378406217165;5360.919586206288;5957.582969192115;5959.791407300723;5985.431384018511;6036.698165091816;5917.467427931507;5943.732532035982;5948.434898684618;5954.4938680210935;5957.136215248678;5698;5756.856078598069;5799.565032622486;5801.970990145022;5816.70916454184;5859.472647461749;5874.089516125007;5882.852928676817;5897.616654917417;5926.911096333644;5746.2529871116485;5748.54011679073;5749.9712501437225;5750.137479378127;5802.187693722966 17:47:47 INFO - PROCESS | 1663 | |1;ext.html;494.43387321516843;578.4158000419575;586.8884911866745;638.2404938123634;638.8881945659508;30810.921617743385;38588;39204.60795392045;39319.21361572767;39478.60521394785;44111.55888441123;44945;45042.54957450424;45148;45180;9720.270979676518;9948.5523151458;9968.551415186297;9976.850347244761;9993.450360230185;9664.855027174597;9831.803363932717;9840.852387214198;9841.95079024604;9859.211263098934;9796.608135674565;9854.753631159207;9860.06329398706;9875.061869122423;9888.258380621483;9766.853497197548;9845;9849.113579777819;9852;9853.65512207073;9677.419354838661;9791.167750741195;9797.853032204523;9808.509574521246;9825.312228144032;41263.793681031406;41467.7926610368;41667.583324166975;41715.58284417148;41816.79091604553;3218.3241519280978;3279.212988882675;3292.703656670911;3310.1393637654382;3510.5260789793306;27407.588886166723;28985.98549050773;29004.27489312763;29031.41937161245;29079.12762617125;2682.383051898055;2703.7161098084616;2771.1686494051705;2854.8001639885215;2863.1983044747294;463918;470105;471532;472760;472892;67144.6642766783;67455;68251;68389.65805170943;68500;74917.25082749102;75097;75194.62402687952;75238;75282;17047.829521704873;17258;17263.913680431768;17279;17300.13499325054;12965.546205882938;13045.152065115737;13081.476740930257;13084.934575327254;13109.082364234602;21080.78919210819;21989.780102199093;22209.333719988426;22314.44213894633;22380;7531.397488200931;8202;9129.497877616663;9426.481543515036;9458.385204961656;924.5700749151677;993.4238141877694;1006.5068116622803;1058.8094143054325;1160.785254727878;22236.55526889453;29475.852620736758;29714.554281685792;29924.401511969638;30103.548446773315;1096.7970925378831;1100.7963526747578;1164.7903377392151;1166.1487114406532;1284.8843604075491;14900.478483253035;14952.551423457313;15019;15388.30752616135;15393.384264629289;533448;536232.3188384111;539652;539735;540117;60295.39704602986;60578.39421605816;60736;60819.69590152021;60884.69557652272;1317.7562151002096;1419.389662445138;1449.1522459361393;1471.4996901053694;1472.926353682333;28904.132876013755;29372.55941160927;29822.701772981993;30075.69924300729;30090.69909300879;48128.5187148124;48733.025339492306;49313.75343123262;49327.753361232964;49371.50628493669;377141;380971;381442;381601;381768;29557.556636650897;29710;32663.18342041373;33740.49389259114;33857.83071084629;43586.69239922807;44410.11179776322;44610.77694611506;44909;45758.54241457543;29331.266718332212;36277;36575;37120.07199819918;37196.07009824776;35544.46683299804;35776.82111589425;35890.46164307485;36763.816180918926;36765.26469470542;35945.64054359423;36307.092322692144;36672.266554668226;36995.815020924725;37027.88916332514;30317;31827.840860796474;31995.68004319927;32073.358532828745;32139.839300803345;23613.64579531274;23822.404439889142;24196.39509012289;24434.63348049745;24455.633165502888 17:47:47 INFO - PROCESS | 1663 | |2;jquery.html;342.31366110947545;363.5274143613304;366.67549218941235;370.5294276269137;375.91166075972126;16410.83589164111;19411.12649930753;19598.510037249074;19640.50898727531;20027.399178024683;19084.236630534797;19998.800011999876;20500;20506.76959382438;20520.589588208226;5561.193626924093;6133.693315334238;6181.1037399577035;6188.566800323979;6192.628442293454;4279.251131052069;4450.554944505556;6024.8493787655225;6394.71223794928;6711.060451536789;6613.239477460082;6633.071370008202;6641.037049627801;6645.43513801325;6657.500687448436;6403.903941440859;6499.675016249193;6554.70503827329;6588.044733513661;6590.604563726168;3757.7369584129124;5385.111456609694;5628.183913332585;5639.971800140973;5651.7739290428335;23527;23753.643695344585;24120;24496.755032449804;24508.387290317707;2125.341144245289;2146.6350720377573;2257.853239539441;2726.481968425993;2816.563432667919;14042.789358159636;14254.786178207336;14396.568102956928;14683.825293976457;14844.406223751037;1747.4670225581192;1777.3246166456793;1777.6178121703895;1787.785465744106;1816.1554876982134;96788;98235.50882245543;99134.53894574761;99164;99379.50310248403;8665.220130188314;10191.082802547806;10326.896731032593;10468.84842667306;10609.204309676805;12683.682907927376;12706.301153436465;12713.682157945941;12740.36298185087;12741.17182383142;8347.040090389683;8380.24577788002;8423.578821058922;8424.283935865398;8521.744347669579;8608.870866937;8618.612162452704;8622.61198246068;8713.869291960626;8730.650773969097;5959.642421454727;6113.877722445615;6220.564560480723;6233.875322493524;6302.621842689453;1491.5301679970773;1599.3122957128314;1689.6282817780068;1766.9646607067787;1840.2271046160376;971.7764914069803;1002.9749256268651;1023.7793780169427;1079.7084787107437;1106.2035334559266;20303;20955.057022434026;21120.366389008046;21137.365879023655;21432.39257055727;954.5275088830934;1020.0921180149672;1021.4177918586334;1041.9010194031555;1070.3203465799274;11159.048853617189;11357.829632555518;11383.552536204756;11393.601223957121;11424.485898134437;593000;596887;601798;605582;613882;100368;102353.97646023594;102655;104868;107156;1041.3335465302212;1074.6829685242872;1088.314361951981;1091.0943916549245;1091.9071878890225;18422;18658.813411865707;18695.065246737882;18740.906295468434;18936.810631893506;43980.56019439764;44600;45825.54174458346;46975.765121174176;47398;53924;59855.401445986725;59968.70485074646;60064.39935600588;60156;10478.528466219192;10507.31702439339;10795.838062428913;11218.887811122111;11375.886241137814;11106.777864442503;12569.371531423576;12918.031147663774;12936.173614962812;13044.869551304746;11370.658880233606;11453.026492747877;11513.194076414571;11701.590444334408;11729.35488548104;10845;11326.830097548378;11339.943300283447;11396.715082123013;11806;10604.416757078126;10804.891951080388;11571;11876;11964.880351196376;11514.963653271247;11678.124140689313;11690.941545292219;11750.412479376168;11786.057115430573;11411.657650270505;11452.713682158013;11646.825297620373;11780.941095294469;12259.957903578295 17:47:47 INFO - PROCESS | 1663 | |3;mootools.html;1430.1347684650793;1555.0203371875718;1588.1662127383122;1888.9527761805953;2059.3307175168075;7850.7644770656825;8544.70093546726;8693.47839129652;8696.47821130731;8713.172248636385;8346.290565301957;8576.785580360494;8577.185167409101;8579.099194584573;8580.227779499844;1873.644007638551;2136.9679454808193;2194.6707993800896;2434.2697190842764;2468.06213638817;2409.903603855844;2485.801135909132;2486.018022880961;2489.278109348296;2489.2905521926255;2411.7708817662383;2431.173401043645;2439.9634005489934;2445.205308274809;2448.461338505526;2412.6984126984125;2419.588669926108;2435.391152211947;2441.035790862617;2443.3769388805918;2369.099742098009;2371.312319427364;2375.904963801463;2382.749811269809;2392.437777122392;8694;8720.651173953034;8744.169303916118;8764.079771624016;8771.210591046836;5332.600054995891;5361.410244873061;5455.072637651609;5512.5589952803675;5523.6409633373705;3495.5805303363504;3629.9836045906923;3632.5822530409077;3686;3692.7968961707097;1031.5770534080991;1043.7338478687961;1051.9737006574821;1055.472263868066;1059.5549869055014;11814.704632384173;11852.34812085335;11856.40717964107;11860;11867.406629668481;4753.572178503951;4872.220444728827;4897.681650692693;4928.876778080505;4953.356063711694;8947.552622368856;9762.36544624597;10073.841508226647;10083.647072352433;10115.595376185018;5489.643173193809;5496.615236933456;5503.3395992481155;5504.449555044544;5507.402853172535;4264.488261408651;4402.9559704402545;4726.787294571753;4940.925886111711;4978.726170060609;3409.9488507672404;3800.125971026624;3933.665638420709;3968.444417781513;4041.4948131483566;1135.40391294571;1298.5195477673321;1318.0378323823663;1321.8744219299151;1329.8470675872204;1379.4689044717654;1388.2919710947288;1430.5851303122186;1432.978505322421;1441.704450587627;7874.448788584744;8190.7952301192945;8196.877046844302;8227.71203007892;8251.174882511701;1231.4581584102966;1232.7719371916046;1239.9814002789965;1253.4046327994313;1266.2149467330314;6277.372262773686;6340.936590634127;6386.552941294065;6404.679766011681;6411.96794016027;8253.669853205925;10574.721836230792;10586.364818110938;10667.679969600924;10688.572457101784;10263.794724105475;10350.792984140275;10458.843117353246;10559.736006599744;10560.630377936735;8108.635111420001;8284.25441710249;8320.500769953822;8322.16778322175;8326.04337980574;6655.2346480153465;7524.548527088392;7700.922990770021;7806.960965195138;7864.685412583662;9203.217726493323;9361.344705870524;9481.431114133175;9494.192993595621;9586.712398628053;9460.858087128836;9811.460369679737;9834.409935403899;9878.555465004236;9902.158316542886;6362.331955144643;6531.314212007671;6693.966530167318;7020.613866237406;7146.285371462812;8047.436679432618;8050.718224862102;8077.919220807717;8088.514689118671;8092.109867914643;7122.287771222836;7156;7187.5687458752645;7283.162436319679;7347.595882226529;7074.787756367317;7087.681054352463;7179.8564028720175;7236.38490728294;7253.891191632235;7347.779566612797;7618.428617853572;7622.047244094489;7636.31273185416;7638.732644357421;6840.555363901331;6930.064441300561;6932.6533673315125;6933.341332573397;6948.374646281859;6928.965355173394;7015.403690686348;7023.086998690138;7032.12098487689;7035.015097886402 17:47:47 INFO - PROCESS | 1663 | |4;prototype.html;295.95116805727054;319.35171601648653;322.5935321494916;331.7462141461781;336.81811821616327;5052.646314757963;6482.448991835699;6484.35156484352;6519.380658837415;6561.639109848957;5128.358955130609;6289.842753931154;6446.838829029277;6449.387308205724;6479.481641468683;4126.030382860025;4398.7580683062415;4519.683622146451;4662.207424737802;4763.690360126598;3881.941770873439;4099.754014759109;4708.128996135726;4722.598579120779;4782.234842425212;4702.529747025287;4711.081339138869;4715.740634265114;4739.952600474003;4755.191617425046;4508.797104130322;4561.999999999984;4692.906141877177;4697.976510117462;4743.786529606176;3997.400389941503;4009.799510024487;4010.5187377514594;4016.397540368968;4018.718689691723;6198.101275315099;6251.437370636619;6255.530835187379;6260.311365749764;6263.404976527268;5468.6171967962255;5472.616916815825;5473.917891231635;5478.671279723229;5480.479354461319;6792.76225332111;6794.252632210453;6819.897701534481;6820.761273355459;6826.556273842234;4304.741715497049;4489.236829738919;4493.955060449386;4494.258447356182;4502.662300327489;7125.7505987290715;7225.349718525305;7243.130824301117;7246.058012458347;7262.745803896838;4513.480949690827;4516.277395616686;4526.773661316987;4530.252508336153;4534.8639540813165;3936.271789718854;4442.133783912106;4553.7267763933605;4587.105514424655;4595.517470665532;5438.9394068156325;5440.809571664972;5442.727863606804;5454.290942177571;5457.781688732406;5173.922391164136;6621.139251897319;6882.380585747307;6889.276625954303;6896.137982752156;1567.2085596773557;1577.658989858634;1591.896526725759;1593.251171949182;1594.5296137639425;955.460165006769;983.4050399508337;1015.223354134088;1020.7090979070929;1038.6468600675807;6425.036244563259;6570.244421891448;6587.341265873374;6604.834879127964;6610.735570577219;7213.062301900719;7231.385332246818;7236.276372362827;7246.5289756165685;7259.818504537428;5558;6380.872382552323;6545.509086818508;6546.9017964730565;6557.770478033246;3736.8131593420762;3792.2605092007348;3793.317202903504;3793.829277682511;3796.8481260749813;7167.319104685047;7391.519551229153;7403.18564957865;7427.517211381243;7440.069991251094;7272.96363518179;7355.117385913618;7358.558486490828;7367.668454919542;7389.963050184715;7509.812254693677;7516.774496765215;7525.4355923305975;7540.3213710766295;7541.170471248159;6027.939720602913;6319;6886.24251332343;7152;7191.20896701352;6953.4089602384365;6990.986306985357;6999;7001.0198572198915;7011.298870112948;7380.483366164317;7462.403007759258;7471.178170401143;7477.027986361738;7507.136679281953;4482.731036137711;4538.455385353779;4541.863744087683;4546.090781843711;4556.589906908394;7125.251848555827;7135.6432178391915;7137.85724285501;7143.85712285741;7155.606441645759;6568.408843204134;6868.690908909011;6879.724811007503;6893.75871844483;6904.378605925491;5922.157364464994;6611.173603299588;6882.69027893756;6895.310468953065;6900.896486552806;6723.966380168068;6727.764528241488;6743.022261772114;6757.493188010821;6759.357861003196;6638.236602790741;6881.174259088742;6898.689558969758;6905.827354316182;6916.481263905127;5846.655269288172;6118.418750218722;6621.801345959629;6649.667516624246;6814.386705196556 17:47:47 INFO - PROCESS | 1663 | |5;yui.html;586.4253032028612;654.8231977366108;689.5552368722174;747.7382915979408;756.8259300360916;13067.477300907953;15656.921715391436;15663.295151718172;15668.843311566881;15683.215839208051;14115.57653270401;14229.075110117836;14234.644133896658;14261.286935653228;14269.857301426982;733.9596322202277;745.9403247740195;746.6789280609336;747.543998161124;903.1645727701866;785.2579312549643;816.542736067804;852.1691350932853;905.2034209895315;928.9163975242227;832.6169961817541;962.8555716642489;968.6270785747503;973.9026097390275;975.9167324270054;780.0639232920518;956.5695437053319;964.1708131007329;969.4667932637057;972.154225823531;666.1440049536371;682.2597481732327;728.1880703016099;728.5300980867364;730.5616630021998;15186.392544298214;15291;15306.923465382713;15308;15318.617034574114;12424.813627795591;12486.625401237887;12551.623451296477;12703.301318427482;13022.153560018663;9747;10059.295849290553;10127.442990635513;10173.389596624153;10478.266521343508;3477.9130521736906;3525.1892064825233;3553.680168784822;3566.625504322061;3631.5823680276576;84782.57608711979;86033.13966860314;86261.56869215677;86308;86459;9612;9626.855597166048;9679.467629280458;9916.900830991743;10470.057694807503;18487.53781155455;18647.720284195748;22568.54862902733;22598.887005565197;22635.094596215968;7515.398768098539;7560.470767046364;7578.469507134448;7635.465517413728;7774.378049756006;4088.4276201331836;4153.7300075494995;4154.813033413504;4156.43888075112;4159.147374788161;3586.300671369058;3630.1650620356936;3650.233450975272;3654.0682126057686;3656.7074634029746;630.7256343490596;667.8063361625171;690.8134803602999;714.7748459235428;718.3140101203338;564.2016546586534;575.3814649252071;588.808637192914;601.6029420582395;627.4227710506345;7996.72011479607;8042.155573664681;8127.431079824356;8191.918080819235;8298.294644955125;568.4315684315684;593.5815250248564;612.5008118383503;613.0191693290699;634.4321831960369;3638.581563120275;3780.4140358244517;3826.1773718650625;3876.9418458723144;3977.76133431995;88189;88681.55659221663;88730;89054.55472722594;89595.55202223947;72999;73784.63107684534;75362;78318.6084069576;80270.59864700756;69218;69224.30775692179;69444;69943.65028174827;70428.94356584655;6601.075849380994;7380.963095184705;7550.509216900884;7817.843643126992;8008.799780005546;38445;48949.5105048945;49438;49529.50470495249;49620;66119;67499.3250067493;68172.659136704;68327.97508037284;68786.62426751538;9814.75463113428;9998.800023999625;10176.694699159038;10297.970202979643;10850.186236032172;10914.672559823219;11109.944450277697;11156.721081973015;11469.713257168638;11496.88503114958;8521.147885211429;8697.130286971253;10401.791964160826;10409.42748148859;10757;8976.41653292534;9014.414063085878;9035.141661542142;9307.11582399671;9342.906570934203;10126.291159618757;10150.54322555472;10154.035366640157;10210.948945255226;11042.116630669689;8570.871436928575;8613.353998450017;8643.725097627193;8881.333899957399;9595.904040959502;8595.957020214859;8715;8721.912780872364;8825.073367296598;8983.955080224558 17:47:47 INFO - PROCESS | 1663 | __end_tp_report 17:47:47 INFO - PROCESS | 1663 | __start_cc_report 17:47:47 INFO - PROCESS | 1663 | _x_x_mozilla_cycle_collect,957 17:47:47 INFO - PROCESS | 1663 | __end_cc_report 17:47:47 INFO - PROCESS | 1663 | __startTimestamp1458175667701__endTimestamp 17:47:47 INFO - PROCESS | 1663 | 17:47:47 INFO - PROCESS | 1663 | ------- Summary: start ------- 17:47:47 INFO - PROCESS | 1663 | Number of tests: 6 17:47:47 INFO - PROCESS | 1663 | 17:47:47 INFO - PROCESS | 1663 | [#0] dojo.html Cycles:165 Average:5637.00 Median:5799.57 stddev:650.39 (11.2%) stddev-sans-first:623.46 17:47:47 INFO - PROCESS | 1663 | Values: 3192.0 3336.5 3494.2 3496.6 3558.3 5406.9 5528.5 5622.2 5626.5 5637.9 5401.9 5455.1 5469.9 5471.0 5484.8 4966.4 4984.8 5023.3 5088.1 5100.7 5049.3 5090.2 5100.7 5111.6 5118.8 5016.7 5035.7 5062.2 5074.4 5093.5 5171.1 5226.1 5230.2 5237.4 5297.4 5003.4 5012.6 5098.5 5126.5 5153.5 5398.4 5407.9 5419.1 5438.4 5505.3 6077.9 6091.7 6098.0 6099.5 6118.2 6052.9 6056.5 6153.6 6171.3 6192.5 5688.7 5700.7 5704.5 5709.6 5728.0 6318.0 6341.5 6379.8 6400.1 6410.4 5887.2 5991.0 6049.3 6061.7 6118.3 6158.1 6177.1 6213.4 6215.4 6225.0 6145.4 6147.3 6154.2 6173.4 6177.1 5919.4 6042.3 6100.7 6131.7 6133.6 4800.5 4802.4 4807.4 4837.5 4840.4 4245.5 4280.7 4321.7 4339.9 4400.3 5570.6 5591.8 5661.5 5704.0 5707.9 6207.7 6218.3 6221.5 6227.8 6232.3 5576.5 5600.2 5615.8 5635.3 5659.4 4346.3 4573.7 5322.9 5324.9 5337.7 6305.2 6307.6 6312.2 6314.2 6327.1 6100.8 6254.3 6255.9 6286.1 6296.3 6268.2 6307.8 6309.6 6320.8 6337.6 6051.9 6072.4 6076.2 6080.5 6097.0 5989.7 6157.2 6162.4 6212.4 6215.9 5360.9 5957.6 5959.8 5985.4 6036.7 5917.5 5943.7 5948.4 5954.5 5957.1 5698.0 5756.9 5799.6 5802.0 5816.7 5859.5 5874.1 5882.9 5897.6 5926.9 5746.3 5748.5 5750.0 5750.1 5802.2 17:47:47 INFO - PROCESS | 1663 | 17:47:47 INFO - PROCESS | 1663 | [#1] ext.html Cycles:180 Average:61889.67 Median:381206.50 stddev:124134.16 (32.6%) stddev-sans-first:124396.80 17:47:47 INFO - PROCESS | 1663 | Values: 494.4 578.4 586.9 638.2 638.9 30810.9 38588.0 39204.6 39319.2 39478.6 44111.6 44945.0 45042.5 45148.0 45180.0 9720.3 9948.6 9968.6 9976.9 9993.5 9664.9 9831.8 9840.9 9842.0 9859.2 9796.6 9854.8 9860.1 9875.1 9888.3 9766.9 9845.0 9849.1 9852.0 9853.7 9677.4 9791.2 9797.9 9808.5 9825.3 41263.8 41467.8 41667.6 41715.6 41816.8 3218.3 3279.2 3292.7 3310.1 3510.5 27407.6 28986.0 29004.3 29031.4 29079.1 2682.4 2703.7 2771.2 2854.8 2863.2 463918.0 470105.0 471532.0 472760.0 472892.0 67144.7 67455.0 68251.0 68389.7 68500.0 74917.3 75097.0 75194.6 75238.0 75282.0 17047.8 17258.0 17263.9 17279.0 17300.1 12965.5 13045.2 13081.5 13084.9 13109.1 21080.8 21989.8 22209.3 22314.4 22380.0 7531.4 8202.0 9129.5 9426.5 9458.4 924.6 993.4 1006.5 1058.8 1160.8 22236.6 29475.9 29714.6 29924.4 30103.5 1096.8 1100.8 1164.8 1166.1 1284.9 14900.5 14952.6 15019.0 15388.3 15393.4 533448.0 536232.3 539652.0 539735.0 540117.0 60295.4 60578.4 60736.0 60819.7 60884.7 1317.8 1419.4 1449.2 1471.5 1472.9 28904.1 29372.6 29822.7 30075.7 30090.7 48128.5 48733.0 49313.8 49327.8 49371.5 377141.0 380971.0 381442.0 381601.0 381768.0 29557.6 29710.0 32663.2 33740.5 33857.8 43586.7 44410.1 44610.8 44909.0 45758.5 29331.3 36277.0 36575.0 37120.1 37196.1 35544.5 35776.8 35890.5 36763.8 36765.3 35945.6 36307.1 36672.3 36995.8 37027.9 30317.0 31827.8 31995.7 32073.4 32139.8 23613.6 23822.4 24196.4 24434.6 24455.6 17:47:47 INFO - PROCESS | 1663 | 17:47:47 INFO - PROCESS | 1663 | [#2] jquery.html Cycles:180 Average:33442.32 Median:19619.51 stddev:99231.18 (505.8%) stddev-sans-first:99478.43 17:47:47 INFO - PROCESS | 1663 | Values: 342.3 363.5 366.7 370.5 375.9 16410.8 19411.1 19598.5 19640.5 20027.4 19084.2 19998.8 20500.0 20506.8 20520.6 5561.2 6133.7 6181.1 6188.6 6192.6 4279.3 4450.6 6024.8 6394.7 6711.1 6613.2 6633.1 6641.0 6645.4 6657.5 6403.9 6499.7 6554.7 6588.0 6590.6 3757.7 5385.1 5628.2 5640.0 5651.8 23527.0 23753.6 24120.0 24496.8 24508.4 2125.3 2146.6 2257.9 2726.5 2816.6 14042.8 14254.8 14396.6 14683.8 14844.4 1747.5 1777.3 1777.6 1787.8 1816.2 96788.0 98235.5 99134.5 99164.0 99379.5 8665.2 10191.1 10326.9 10468.8 10609.2 12683.7 12706.3 12713.7 12740.4 12741.2 8347.0 8380.2 8423.6 8424.3 8521.7 8608.9 8618.6 8622.6 8713.9 8730.7 5959.6 6113.9 6220.6 6233.9 6302.6 1491.5 1599.3 1689.6 1767.0 1840.2 971.8 1003.0 1023.8 1079.7 1106.2 20303.0 20955.1 21120.4 21137.4 21432.4 954.5 1020.1 1021.4 1041.9 1070.3 11159.0 11357.8 11383.6 11393.6 11424.5 593000.0 596887.0 601798.0 605582.0 613882.0 100368.0 102354.0 102655.0 104868.0 107156.0 1041.3 1074.7 1088.3 1091.1 1091.9 18422.0 18658.8 18695.1 18740.9 18936.8 43980.6 44600.0 45825.5 46975.8 47398.0 53924.0 59855.4 59968.7 60064.4 60156.0 10478.5 10507.3 10795.8 11218.9 11375.9 11106.8 12569.4 12918.0 12936.2 13044.9 11370.7 11453.0 11513.2 11701.6 11729.4 10845.0 11326.8 11339.9 11396.7 11806.0 10604.4 10804.9 11571.0 11876.0 11964.9 11515.0 11678.1 11690.9 11750.4 11786.1 11411.7 11452.7 11646.8 11780.9 12260.0 17:47:47 INFO - PROCESS | 1663 | 17:47:47 INFO - PROCESS | 1663 | [#3] mootools.html Cycles:180 Average:5966.19 Median:5493.13 stddev:3108.50 (56.6%) stddev-sans-first:3098.52 17:47:47 INFO - PROCESS | 1663 | Values: 1430.1 1555.0 1588.2 1889.0 2059.3 7850.8 8544.7 8693.5 8696.5 8713.2 8346.3 8576.8 8577.2 8579.1 8580.2 1873.6 2137.0 2194.7 2434.3 2468.1 2409.9 2485.8 2486.0 2489.3 2489.3 2411.8 2431.2 2440.0 2445.2 2448.5 2412.7 2419.6 2435.4 2441.0 2443.4 2369.1 2371.3 2375.9 2382.7 2392.4 8694.0 8720.7 8744.2 8764.1 8771.2 5332.6 5361.4 5455.1 5512.6 5523.6 3495.6 3630.0 3632.6 3686.0 3692.8 1031.6 1043.7 1052.0 1055.5 1059.6 11814.7 11852.3 11856.4 11860.0 11867.4 4753.6 4872.2 4897.7 4928.9 4953.4 8947.6 9762.4 10073.8 10083.6 10115.6 5489.6 5496.6 5503.3 5504.4 5507.4 4264.5 4403.0 4726.8 4940.9 4978.7 3409.9 3800.1 3933.7 3968.4 4041.5 1135.4 1298.5 1318.0 1321.9 1329.8 1379.5 1388.3 1430.6 1433.0 1441.7 7874.4 8190.8 8196.9 8227.7 8251.2 1231.5 1232.8 1240.0 1253.4 1266.2 6277.4 6340.9 6386.6 6404.7 6412.0 8253.7 10574.7 10586.4 10667.7 10688.6 10263.8 10350.8 10458.8 10559.7 10560.6 8108.6 8284.3 8320.5 8322.2 8326.0 6655.2 7524.5 7700.9 7807.0 7864.7 9203.2 9361.3 9481.4 9494.2 9586.7 9460.9 9811.5 9834.4 9878.6 9902.2 6362.3 6531.3 6694.0 7020.6 7146.3 8047.4 8050.7 8077.9 8088.5 8092.1 7122.3 7156.0 7187.6 7283.2 7347.6 7074.8 7087.7 7179.9 7236.4 7253.9 7347.8 7618.4 7622.0 7636.3 7638.7 6840.6 6930.1 6932.7 6933.3 6948.4 6929.0 7015.4 7023.1 7032.1 7035.0 17:47:47 INFO - PROCESS | 1663 | 17:47:47 INFO - PROCESS | 1663 | [#4] prototype.html Cycles:180 Average:5587.14 Median:6448.11 stddev:1810.58 (28.1%) stddev-sans-first:1771.57 17:47:47 INFO - PROCESS | 1663 | Values: 296.0 319.4 322.6 331.7 336.8 5052.6 6482.4 6484.4 6519.4 6561.6 5128.4 6289.8 6446.8 6449.4 6479.5 4126.0 4398.8 4519.7 4662.2 4763.7 3881.9 4099.8 4708.1 4722.6 4782.2 4702.5 4711.1 4715.7 4740.0 4755.2 4508.8 4562.0 4692.9 4698.0 4743.8 3997.4 4009.8 4010.5 4016.4 4018.7 6198.1 6251.4 6255.5 6260.3 6263.4 5468.6 5472.6 5473.9 5478.7 5480.5 6792.8 6794.3 6819.9 6820.8 6826.6 4304.7 4489.2 4494.0 4494.3 4502.7 7125.8 7225.3 7243.1 7246.1 7262.7 4513.5 4516.3 4526.8 4530.3 4534.9 3936.3 4442.1 4553.7 4587.1 4595.5 5438.9 5440.8 5442.7 5454.3 5457.8 5173.9 6621.1 6882.4 6889.3 6896.1 1567.2 1577.7 1591.9 1593.3 1594.5 955.5 983.4 1015.2 1020.7 1038.6 6425.0 6570.2 6587.3 6604.8 6610.7 7213.1 7231.4 7236.3 7246.5 7259.8 5558.0 6380.9 6545.5 6546.9 6557.8 3736.8 3792.3 3793.3 3793.8 3796.8 7167.3 7391.5 7403.2 7427.5 7440.1 7273.0 7355.1 7358.6 7367.7 7390.0 7509.8 7516.8 7525.4 7540.3 7541.2 6027.9 6319.0 6886.2 7152.0 7191.2 6953.4 6991.0 6999.0 7001.0 7011.3 7380.5 7462.4 7471.2 7477.0 7507.1 4482.7 4538.5 4541.9 4546.1 4556.6 7125.3 7135.6 7137.9 7143.9 7155.6 6568.4 6868.7 6879.7 6893.8 6904.4 5922.2 6611.2 6882.7 6895.3 6900.9 6724.0 6727.8 6743.0 6757.5 6759.4 6638.2 6881.2 6898.7 6905.8 6916.5 5846.7 6118.4 6621.8 6649.7 6814.4 17:47:47 INFO - PROCESS | 1663 | 17:47:47 INFO - PROCESS | 1663 | [#5] yui.html Cycles:180 Average:17980.85 Median:34505.12 stddev:25638.23 (74.3%) stddev-sans-first:25676.88 17:47:47 INFO - PROCESS | 1663 | Values: 586.4 654.8 689.6 747.7 756.8 13067.5 15656.9 15663.3 15668.8 15683.2 14115.6 14229.1 14234.6 14261.3 14269.9 734.0 745.9 746.7 747.5 903.2 785.3 816.5 852.2 905.2 928.9 832.6 962.9 968.6 973.9 975.9 780.1 956.6 964.2 969.5 972.2 666.1 682.3 728.2 728.5 730.6 15186.4 15291.0 15306.9 15308.0 15318.6 12424.8 12486.6 12551.6 12703.3 13022.2 9747.0 10059.3 10127.4 10173.4 10478.3 3477.9 3525.2 3553.7 3566.6 3631.6 84782.6 86033.1 86261.6 86308.0 86459.0 9612.0 9626.9 9679.5 9916.9 10470.1 18487.5 18647.7 22568.5 22598.9 22635.1 7515.4 7560.5 7578.5 7635.5 7774.4 4088.4 4153.7 4154.8 4156.4 4159.1 3586.3 3630.2 3650.2 3654.1 3656.7 630.7 667.8 690.8 714.8 718.3 564.2 575.4 588.8 601.6 627.4 7996.7 8042.2 8127.4 8191.9 8298.3 568.4 593.6 612.5 613.0 634.4 3638.6 3780.4 3826.2 3876.9 3977.8 88189.0 88681.6 88730.0 89054.6 89595.6 72999.0 73784.6 75362.0 78318.6 80270.6 69218.0 69224.3 69444.0 69943.7 70428.9 6601.1 7381.0 7550.5 7817.8 8008.8 38445.0 48949.5 49438.0 49529.5 49620.0 66119.0 67499.3 68172.7 68328.0 68786.6 9814.8 9998.8 10176.7 10298.0 10850.2 10914.7 11109.9 11156.7 11469.7 11496.9 8521.1 8697.1 10401.8 10409.4 10757.0 8976.4 9014.4 9035.1 9307.1 9342.9 10126.3 10150.5 10154.0 10210.9 11042.1 8570.9 8613.4 8643.7 8881.3 9595.9 8596.0 8715.0 8721.9 8825.1 8984.0 17:47:47 INFO - PROCESS | 1663 | -------- Summary: end -------- 17:47:47 INFO - PROCESS | 1663 | 17:47:48 INFO - TEST-INFO | 1663: exit 0 17:47:48 INFO - TEST-OK | dromaeo_css | took 1113116ms 17:47:48 INFO - TEST-START | kraken 17:47:48 INFO - operating with platform_type : mac_ 17:47:48 INFO - Initialising browser for kraken test... 17:47:48 INFO - TEST-INFO | started process 1673 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/tmpIGnoy2/profile http://localhost:49271/getInfo.html) 17:47:50 INFO - PROCESS | 1673 | __metrics Screen width/height:1600/1200 17:47:50 INFO - PROCESS | 1673 | colorDepth:24 17:47:50 INFO - PROCESS | 1673 | Browser inner width/height: 1024/689 17:47:50 INFO - PROCESS | 1673 | __metrics 17:47:50 INFO - PROCESS | 1673 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 17:47:50 ERROR - PROCESS | 1673 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 17:47:51 INFO - TEST-INFO | 1673: exit 0 17:47:51 INFO - Browser initialized. 17:47:51 INFO - Running cycle 1/1 for kraken test... 17:47:51 INFO - TEST-INFO | started process 1675 (/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/tmpIGnoy2/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:48:03 INFO - PROCESS | 1675 | RSS: Main: 243421184 17:48:03 INFO - PROCESS | 1675 | 17:48:05 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-beat-detection) 17:48:06 INFO - PROCESS | 1675 | RSS: Main: 290000896 17:48:06 INFO - PROCESS | 1675 | 17:48:08 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-dft) 17:48:09 INFO - PROCESS | 1675 | RSS: Main: 300113920 17:48:09 INFO - PROCESS | 1675 | 17:48:12 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-fft) 17:48:13 INFO - PROCESS | 1675 | RSS: Main: 285159424 17:48:13 INFO - PROCESS | 1675 | 17:48:15 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49271/tests/kraken/driver.html?testName=audio-oscillator) 17:48:16 INFO - PROCESS | 1675 | RSS: Main: 289214464 17:48:16 INFO - PROCESS | 1675 | 17:48:18 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:48:18 INFO - PROCESS | 1675 | RSS: Main: 289165312 17:48:18 INFO - PROCESS | 1675 | 17:48:21 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-darkroom) 17:48:21 INFO - PROCESS | 1675 | RSS: Main: 289042432 17:48:21 INFO - PROCESS | 1675 | 17:48:24 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49271/tests/kraken/driver.html?testName=imaging-desaturate) 17:48:25 INFO - PROCESS | 1675 | RSS: Main: 288997376 17:48:25 INFO - PROCESS | 1675 | 17:48:28 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49271/tests/kraken/driver.html?testName=json-parse-financial) 17:48:28 INFO - PROCESS | 1675 | RSS: Main: 288329728 17:48:28 INFO - PROCESS | 1675 | 17:48:30 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49271/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:48:31 INFO - PROCESS | 1675 | RSS: Main: 325005312 17:48:31 INFO - PROCESS | 1675 | 17:48:32 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:48:33 INFO - PROCESS | 1675 | RSS: Main: 323702784 17:48:33 INFO - PROCESS | 1675 | 17:48:35 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:48:36 INFO - PROCESS | 1675 | RSS: Main: 332709888 17:48:36 INFO - PROCESS | 1675 | 17:48:38 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:48:39 INFO - PROCESS | 1675 | RSS: Main: 334667776 17:48:39 INFO - PROCESS | 1675 | 17:48:41 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:48:42 INFO - PROCESS | 1675 | RSS: Main: 334430208 17:48:42 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | Cycle 1(1): loaded http://localhost:49271/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49271/tests/kraken/driver.html?testName=ai-astar) 17:48:44 INFO - PROCESS | 1675 | RSS: Main: 394874880 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | __start_tp_report 17:48:44 INFO - PROCESS | 1675 | _x_x_mozilla_page_load 17:48:44 INFO - PROCESS | 1675 | _x_x_mozilla_page_load_details 17:48:44 INFO - PROCESS | 1675 | |i|pagename|runs| 17:48:44 INFO - PROCESS | 1675 | |0;ai-astar;104;105;110;111;109;110;113;109;113;111 17:48:44 INFO - PROCESS | 1675 | |1;audio-beat-detection;155;122;141;159;120;139;140;118;157;117 17:48:44 INFO - PROCESS | 1675 | |2;audio-dft;182;187;188;256;211;182;184;187;181;181 17:48:44 INFO - PROCESS | 1675 | |3;audio-fft;77;75;72;114;55;60;57;63;121;56 17:48:44 INFO - PROCESS | 1675 | |4;audio-oscillator;91;94;128;81;78;88;120;76;80;116 17:48:44 INFO - PROCESS | 1675 | |5;imaging-gaussian-blur;87;83;87;84;88;83;87;84;87;84 17:48:44 INFO - PROCESS | 1675 | |6;imaging-darkroom;92;94;93;93;94;92;94;95;103;149 17:48:44 INFO - PROCESS | 1675 | |7;imaging-desaturate;87;86;85;85;86;87;103;142;141;87 17:48:44 INFO - PROCESS | 1675 | |8;json-parse-financial;56;56;56;53;54;53;54;63;56;53 17:48:44 INFO - PROCESS | 1675 | |9;json-stringify-tinderbox;66;64;70;76;78;74;71;67;67;67 17:48:44 INFO - PROCESS | 1675 | |10;stanford-crypto-aes;83;83;83;84;84;82;83;82;84;84 17:48:44 INFO - PROCESS | 1675 | |11;stanford-crypto-ccm;131;120;122;124;116;120;120;122;130;118 17:48:44 INFO - PROCESS | 1675 | |12;stanford-crypto-pbkdf2;140;140;138;138;139;126;138;138;137;138 17:48:44 INFO - PROCESS | 1675 | |13;stanford-crypto-sha256-iterative;66;66;67;70;95;92;92;83;83;67 17:48:44 INFO - PROCESS | 1675 | __end_tp_report 17:48:44 INFO - PROCESS | 1675 | __start_cc_report 17:48:44 INFO - PROCESS | 1675 | _x_x_mozilla_cycle_collect,1190 17:48:44 INFO - PROCESS | 1675 | __end_cc_report 17:48:44 INFO - PROCESS | 1675 | __startTimestamp1458175724401__endTimestamp 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | ------- Summary: start ------- 17:48:44 INFO - PROCESS | 1675 | Number of tests: 14 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#0] ai-astar Cycles:10 Average:109.50 Median:110.50 stddev:2.99 (2.7%) stddev-sans-first:2.42 17:48:44 INFO - PROCESS | 1675 | Values: 104.0 105.0 110.0 111.0 109.0 110.0 113.0 109.0 113.0 111.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#1] audio-beat-detection Cycles:10 Average:136.80 Median:140.50 stddev:16.71 (11.9%) stddev-sans-first:16.37 17:48:44 INFO - PROCESS | 1675 | Values: 155.0 122.0 141.0 159.0 120.0 139.0 140.0 118.0 157.0 117.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#2] audio-dft Cycles:10 Average:193.90 Median:187.00 stddev:23.55 (12.6%) stddev-sans-first:24.59 17:48:44 INFO - PROCESS | 1675 | Values: 182.0 187.0 188.0 256.0 211.0 182.0 184.0 187.0 181.0 181.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#3] audio-fft Cycles:10 Average:75.00 Median:61.50 stddev:23.81 (38.7%) stddev-sans-first:25.25 17:48:44 INFO - PROCESS | 1675 | Values: 77.0 75.0 72.0 114.0 55.0 60.0 57.0 63.0 121.0 56.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#4] audio-oscillator Cycles:10 Average:95.20 Median:80.50 stddev:19.12 (23.8%) stddev-sans-first:20.22 17:48:44 INFO - PROCESS | 1675 | Values: 91.0 94.0 128.0 81.0 78.0 88.0 120.0 76.0 80.0 116.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#5] imaging-gaussian-blur Cycles:10 Average:85.40 Median:87.00 stddev:1.96 (2.2%) stddev-sans-first:1.99 17:48:44 INFO - PROCESS | 1675 | Values: 87.0 83.0 87.0 84.0 88.0 83.0 87.0 84.0 87.0 84.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#6] imaging-darkroom Cycles:10 Average:99.90 Median:93.50 stddev:17.54 (18.8%) stddev-sans-first:18.37 17:48:44 INFO - PROCESS | 1675 | Values: 92.0 94.0 93.0 93.0 94.0 92.0 94.0 95.0 103.0 149.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#7] imaging-desaturate Cycles:10 Average:98.90 Median:86.00 stddev:23.07 (26.8%) stddev-sans-first:24.07 17:48:44 INFO - PROCESS | 1675 | Values: 87.0 86.0 85.0 85.0 86.0 87.0 103.0 142.0 141.0 87.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#8] json-parse-financial Cycles:10 Average:55.40 Median:56.00 stddev:2.99 (5.3%) stddev-sans-first:3.16 17:48:44 INFO - PROCESS | 1675 | Values: 56.0 56.0 56.0 53.0 54.0 53.0 54.0 63.0 56.0 53.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#9] json-stringify-tinderbox Cycles:10 Average:70.00 Median:70.50 stddev:4.67 (6.6%) stddev-sans-first:4.72 17:48:44 INFO - PROCESS | 1675 | Values: 66.0 64.0 70.0 76.0 78.0 74.0 71.0 67.0 67.0 67.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#10] stanford-crypto-aes Cycles:10 Average:83.20 Median:83.50 stddev:0.79 (0.9%) stddev-sans-first:0.83 17:48:44 INFO - PROCESS | 1675 | Values: 83.0 83.0 83.0 84.0 84.0 82.0 83.0 82.0 84.0 84.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#11] stanford-crypto-ccm Cycles:10 Average:122.30 Median:122.00 stddev:4.85 (4.0%) stddev-sans-first:4.00 17:48:44 INFO - PROCESS | 1675 | Values: 131.0 120.0 122.0 124.0 116.0 120.0 120.0 122.0 130.0 118.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:137.20 Median:138.00 stddev:4.05 (2.9%) stddev-sans-first:4.17 17:48:44 INFO - PROCESS | 1675 | Values: 140.0 140.0 138.0 138.0 139.0 126.0 138.0 138.0 137.0 138.0 17:48:44 INFO - PROCESS | 1675 | 17:48:44 INFO - PROCESS | 1675 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:78.10 Median:83.00 stddev:12.13 (14.6%) stddev-sans-first:12.05 17:48:44 INFO - PROCESS | 1675 | Values: 66.0 66.0 67.0 70.0 95.0 92.0 92.0 83.0 83.0 67.0 17:48:44 INFO - PROCESS | 1675 | -------- Summary: end -------- 17:48:44 INFO - PROCESS | 1675 | 17:48:45 INFO - TEST-INFO | 1675: exit 0 17:48:45 INFO - TEST-OK | kraken | took 56865ms 17:48:45 INFO - SUITE-END | took 1169s 17:48:45 INFO - Completed test suite (00:19:30) 17:48:45 INFO - javascript benchmark 17:48:45 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3191.968080319197, 3336.549565808615, 3494.1963348429877, 3496.566407772813, 3558.341706784245, 5406.864828379293, 5528.5024347808685, 5622.212890195371, 5626.465485778845, 5637.887242255158, 5401.891962160755, 5455.1271796512565, 5469.890602187954, 5471.042567550673, 5484.808031718891, 4966.404031516223, 4984.800607975695, 5023.296738456601, 5088.0587091388215, 5100.69395836251, 5049.293098966147, 5090.185570308751, 5100.744962751866, 5111.591072714193, 5118.8464346069495, 5016.749162541876, 5035.748212589374, 5062.215356619711, 5074.3657042869645, 5093.541581257686, 5171.120909445403, 5226.085435048852, 5230.163173892197, 5237.371515418136, 5297.390800057966, 5003.449620541737, 5012.624053196025, 5098.490150984909, 5126.461721519224, 5153.484651534854, 5398.352197736258, 5407.891842163135, 5419.105847535152, 5438.428964958662, 5505.311836020457, 6077.939220607782, 6091.725872335755, 6097.969510152465, 6099.512039036867, 6118.204633397674, 6052.939470605282, 6056.485198758067, 6153.600015998945, 6171.321154673027, 6192.504599632019, 5688.687122208318, 5700.743466544015, 5704.486596206279, 5709.628874123168, 5727.968965586193, 6318.020706790455, 6341.460975817107, 6379.776707815204, 6400.135981642512, 6410.423061924449, 5887.20522729426, 5991.0, 6049.274087109487, 6061.72722227492, 6118.265808102967, 6158.097404281649, 6177.135201071854, 6213.409726076015, 6215.440610345091, 6224.968875155686, 6145.354737752561, 6147.323794382614, 6154.169187159766, 6173.444390004921, 6177.073438984188, 5919.4080591940465, 6042.274927008787, 6100.73256437228, 6131.713108457284, 6133.640713961371, 4800.543948324904, 4802.423709154924, 4807.423109226846, 4837.467878533358, 4840.394950631171, 4245.469316335458, 4280.6789490788315, 4321.6974811762875, 4339.891502712458, 4400.251957167289, 5570.5543556516195, 5591.776328946797, 5661.490465858093, 5704.0, 5707.8858422832145, 6207.6585787782105, 6218.347073557302, 6221.502279817604, 6227.813165605039, 6232.345603711636, 5576.498115169654, 5600.187972743929, 5615.803446879421, 5635.323761148688, 5659.405762394889, 4346.261135606955, 4573.719358579603, 5322.92015619766, 5324.866878328073, 5337.733113344318, 6305.243370795534, 6307.621542707452, 6312.242530896322, 6314.242290924934, 6327.050942358683, 6100.847478813065, 6254.2807577129215, 6255.906161407674, 6286.057091436322, 6296.275928268308, 6268.185135932482, 6307.810765677037, 6309.558330916791, 6320.810375688737, 6337.588056776295, 6051.878962420815, 6072.362401947732, 6076.210092687922, 6080.513558915188, 6097.024476083805, 5989.670568118795, 6157.199564056644, 6162.445379915829, 6212.4408803207925, 6215.9378406217165, 5360.919586206288, 5957.582969192115, 5959.791407300723, 5985.431384018511, 6036.698165091816, 5917.467427931507, 5943.732532035982, 5948.434898684618, 5954.4938680210935, 5957.136215248678, 5698.0, 5756.856078598069, 5799.565032622486, 5801.970990145022, 5816.70916454184, 5859.472647461749, 5874.089516125007, 5882.852928676817, 5897.616654917417, 5926.911096333644, 5746.2529871116485, 5748.54011679073, 5749.9712501437225, 5750.137479378127, 5802.187693722966], "unit": "score", "name": "dojo.html", "value": 5594.97969697277}, {"lowerIsBetter": false, "replicates": [494.43387321516843, 578.4158000419575, 586.8884911866745, 638.2404938123634, 638.8881945659508, 30810.921617743385, 38588.0, 39204.60795392045, 39319.21361572767, 39478.60521394785, 44111.55888441123, 44945.0, 45042.54957450424, 45148.0, 45180.0, 9720.270979676518, 9948.5523151458, 9968.551415186297, 9976.850347244761, 9993.450360230185, 9664.855027174597, 9831.803363932717, 9840.852387214198, 9841.95079024604, 9859.211263098934, 9796.608135674565, 9854.753631159207, 9860.06329398706, 9875.061869122423, 9888.258380621483, 9766.853497197548, 9845.0, 9849.113579777819, 9852.0, 9853.65512207073, 9677.419354838661, 9791.167750741195, 9797.853032204523, 9808.509574521246, 9825.312228144032, 41263.793681031406, 41467.7926610368, 41667.583324166975, 41715.58284417148, 41816.79091604553, 3218.3241519280978, 3279.212988882675, 3292.703656670911, 3310.1393637654382, 3510.5260789793306, 27407.588886166723, 28985.98549050773, 29004.27489312763, 29031.41937161245, 29079.12762617125, 2682.383051898055, 2703.7161098084616, 2771.1686494051705, 2854.8001639885215, 2863.1983044747294, 463918.0, 470105.0, 471532.0, 472760.0, 472892.0, 67144.6642766783, 67455.0, 68251.0, 68389.65805170943, 68500.0, 74917.25082749102, 75097.0, 75194.62402687952, 75238.0, 75282.0, 17047.829521704873, 17258.0, 17263.913680431768, 17279.0, 17300.13499325054, 12965.546205882938, 13045.152065115737, 13081.476740930257, 13084.934575327254, 13109.082364234602, 21080.78919210819, 21989.780102199093, 22209.333719988426, 22314.44213894633, 22380.0, 7531.397488200931, 8202.0, 9129.497877616663, 9426.481543515036, 9458.385204961656, 924.5700749151677, 993.4238141877694, 1006.5068116622803, 1058.8094143054325, 1160.785254727878, 22236.55526889453, 29475.852620736758, 29714.554281685792, 29924.401511969638, 30103.548446773315, 1096.7970925378831, 1100.7963526747578, 1164.7903377392151, 1166.1487114406532, 1284.8843604075491, 14900.478483253035, 14952.551423457313, 15019.0, 15388.30752616135, 15393.384264629289, 533448.0, 536232.3188384111, 539652.0, 539735.0, 540117.0, 60295.39704602986, 60578.39421605816, 60736.0, 60819.69590152021, 60884.69557652272, 1317.7562151002096, 1419.389662445138, 1449.1522459361393, 1471.4996901053694, 1472.926353682333, 28904.132876013755, 29372.55941160927, 29822.701772981993, 30075.69924300729, 30090.69909300879, 48128.5187148124, 48733.025339492306, 49313.75343123262, 49327.753361232964, 49371.50628493669, 377141.0, 380971.0, 381442.0, 381601.0, 381768.0, 29557.556636650897, 29710.0, 32663.18342041373, 33740.49389259114, 33857.83071084629, 43586.69239922807, 44410.11179776322, 44610.77694611506, 44909.0, 45758.54241457543, 29331.266718332212, 36277.0, 36575.0, 37120.07199819918, 37196.07009824776, 35544.46683299804, 35776.82111589425, 35890.46164307485, 36763.816180918926, 36765.26469470542, 35945.64054359423, 36307.092322692144, 36672.266554668226, 36995.815020924725, 37027.88916332514, 30317.0, 31827.840860796474, 31995.68004319927, 32073.358532828745, 32139.839300803345, 23613.64579531274, 23822.404439889142, 24196.39509012289, 24434.63348049745, 24455.633165502888], "unit": "score", "name": "ext.html", "value": 20010.437730707403}, {"lowerIsBetter": false, "replicates": [342.31366110947545, 363.5274143613304, 366.67549218941235, 370.5294276269137, 375.91166075972126, 16410.83589164111, 19411.12649930753, 19598.510037249074, 19640.50898727531, 20027.399178024683, 19084.236630534797, 19998.800011999876, 20500.0, 20506.76959382438, 20520.589588208226, 5561.193626924093, 6133.693315334238, 6181.1037399577035, 6188.566800323979, 6192.628442293454, 4279.251131052069, 4450.554944505556, 6024.8493787655225, 6394.71223794928, 6711.060451536789, 6613.239477460082, 6633.071370008202, 6641.037049627801, 6645.43513801325, 6657.500687448436, 6403.903941440859, 6499.675016249193, 6554.70503827329, 6588.044733513661, 6590.604563726168, 3757.7369584129124, 5385.111456609694, 5628.183913332585, 5639.971800140973, 5651.7739290428335, 23527.0, 23753.643695344585, 24120.0, 24496.755032449804, 24508.387290317707, 2125.341144245289, 2146.6350720377573, 2257.853239539441, 2726.481968425993, 2816.563432667919, 14042.789358159636, 14254.786178207336, 14396.568102956928, 14683.825293976457, 14844.406223751037, 1747.4670225581192, 1777.3246166456793, 1777.6178121703895, 1787.785465744106, 1816.1554876982134, 96788.0, 98235.50882245543, 99134.53894574761, 99164.0, 99379.50310248403, 8665.220130188314, 10191.082802547806, 10326.896731032593, 10468.84842667306, 10609.204309676805, 12683.682907927376, 12706.301153436465, 12713.682157945941, 12740.36298185087, 12741.17182383142, 8347.040090389683, 8380.24577788002, 8423.578821058922, 8424.283935865398, 8521.744347669579, 8608.870866937, 8618.612162452704, 8622.61198246068, 8713.869291960626, 8730.650773969097, 5959.642421454727, 6113.877722445615, 6220.564560480723, 6233.875322493524, 6302.621842689453, 1491.5301679970773, 1599.3122957128314, 1689.6282817780068, 1766.9646607067787, 1840.2271046160376, 971.7764914069803, 1002.9749256268651, 1023.7793780169427, 1079.7084787107437, 1106.2035334559266, 20303.0, 20955.057022434026, 21120.366389008046, 21137.365879023655, 21432.39257055727, 954.5275088830934, 1020.0921180149672, 1021.4177918586334, 1041.9010194031555, 1070.3203465799274, 11159.048853617189, 11357.829632555518, 11383.552536204756, 11393.601223957121, 11424.485898134437, 593000.0, 596887.0, 601798.0, 605582.0, 613882.0, 100368.0, 102353.97646023594, 102655.0, 104868.0, 107156.0, 1041.3335465302212, 1074.6829685242872, 1088.314361951981, 1091.0943916549245, 1091.9071878890225, 18422.0, 18658.813411865707, 18695.065246737882, 18740.906295468434, 18936.810631893506, 43980.56019439764, 44600.0, 45825.54174458346, 46975.765121174176, 47398.0, 53924.0, 59855.401445986725, 59968.70485074646, 60064.39935600588, 60156.0, 10478.528466219192, 10507.31702439339, 10795.838062428913, 11218.887811122111, 11375.886241137814, 11106.777864442503, 12569.371531423576, 12918.031147663774, 12936.173614962812, 13044.869551304746, 11370.658880233606, 11453.026492747877, 11513.194076414571, 11701.590444334408, 11729.35488548104, 10845.0, 11326.830097548378, 11339.943300283447, 11396.715082123013, 11806.0, 10604.416757078126, 10804.891951080388, 11571.0, 11876.0, 11964.880351196376, 11514.963653271247, 11678.124140689313, 11690.941545292219, 11750.412479376168, 11786.057115430573, 11411.657650270505, 11452.713682158013, 11646.825297620373, 11780.941095294469, 12259.957903578295], "unit": "score", "name": "jquery.html", "value": 9718.681311357013}, {"lowerIsBetter": false, "replicates": [1430.1347684650793, 1555.0203371875718, 1588.1662127383122, 1888.9527761805953, 2059.3307175168075, 7850.7644770656825, 8544.70093546726, 8693.47839129652, 8696.47821130731, 8713.172248636385, 8346.290565301957, 8576.785580360494, 8577.185167409101, 8579.099194584573, 8580.227779499844, 1873.644007638551, 2136.9679454808193, 2194.6707993800896, 2434.2697190842764, 2468.06213638817, 2409.903603855844, 2485.801135909132, 2486.018022880961, 2489.278109348296, 2489.2905521926255, 2411.7708817662383, 2431.173401043645, 2439.9634005489934, 2445.205308274809, 2448.461338505526, 2412.6984126984125, 2419.588669926108, 2435.391152211947, 2441.035790862617, 2443.3769388805918, 2369.099742098009, 2371.312319427364, 2375.904963801463, 2382.749811269809, 2392.437777122392, 8694.0, 8720.651173953034, 8744.169303916118, 8764.079771624016, 8771.210591046836, 5332.600054995891, 5361.410244873061, 5455.072637651609, 5512.5589952803675, 5523.6409633373705, 3495.5805303363504, 3629.9836045906923, 3632.5822530409077, 3686.0, 3692.7968961707097, 1031.5770534080991, 1043.7338478687961, 1051.9737006574821, 1055.472263868066, 1059.5549869055014, 11814.704632384173, 11852.34812085335, 11856.40717964107, 11860.0, 11867.406629668481, 4753.572178503951, 4872.220444728827, 4897.681650692693, 4928.876778080505, 4953.356063711694, 8947.552622368856, 9762.36544624597, 10073.841508226647, 10083.647072352433, 10115.595376185018, 5489.643173193809, 5496.615236933456, 5503.3395992481155, 5504.449555044544, 5507.402853172535, 4264.488261408651, 4402.9559704402545, 4726.787294571753, 4940.925886111711, 4978.726170060609, 3409.9488507672404, 3800.125971026624, 3933.665638420709, 3968.444417781513, 4041.4948131483566, 1135.40391294571, 1298.5195477673321, 1318.0378323823663, 1321.8744219299151, 1329.8470675872204, 1379.4689044717654, 1388.2919710947288, 1430.5851303122186, 1432.978505322421, 1441.704450587627, 7874.448788584744, 8190.7952301192945, 8196.877046844302, 8227.71203007892, 8251.174882511701, 1231.4581584102966, 1232.7719371916046, 1239.9814002789965, 1253.4046327994313, 1266.2149467330314, 6277.372262773686, 6340.936590634127, 6386.552941294065, 6404.679766011681, 6411.96794016027, 8253.669853205925, 10574.721836230792, 10586.364818110938, 10667.679969600924, 10688.572457101784, 10263.794724105475, 10350.792984140275, 10458.843117353246, 10559.736006599744, 10560.630377936735, 8108.635111420001, 8284.25441710249, 8320.500769953822, 8322.16778322175, 8326.04337980574, 6655.2346480153465, 7524.548527088392, 7700.922990770021, 7806.960965195138, 7864.685412583662, 9203.217726493323, 9361.344705870524, 9481.431114133175, 9494.192993595621, 9586.712398628053, 9460.858087128836, 9811.460369679737, 9834.409935403899, 9878.555465004236, 9902.158316542886, 6362.331955144643, 6531.314212007671, 6693.966530167318, 7020.613866237406, 7146.285371462812, 8047.436679432618, 8050.718224862102, 8077.919220807717, 8088.514689118671, 8092.109867914643, 7122.287771222836, 7156.0, 7187.5687458752645, 7283.162436319679, 7347.595882226529, 7074.787756367317, 7087.681054352463, 7179.8564028720175, 7236.38490728294, 7253.891191632235, 7347.779566612797, 7618.428617853572, 7622.047244094489, 7636.31273185416, 7638.732644357421, 6840.555363901331, 6930.064441300561, 6932.6533673315125, 6933.341332573397, 6948.374646281859, 6928.965355173394, 7015.403690686348, 7023.086998690138, 7032.12098487689, 7035.015097886402], "unit": "score", "name": "mootools.html", "value": 4900.842692716686}, {"lowerIsBetter": false, "replicates": [295.95116805727054, 319.35171601648653, 322.5935321494916, 331.7462141461781, 336.81811821616327, 5052.646314757963, 6482.448991835699, 6484.35156484352, 6519.380658837415, 6561.639109848957, 5128.358955130609, 6289.842753931154, 6446.838829029277, 6449.387308205724, 6479.481641468683, 4126.030382860025, 4398.7580683062415, 4519.683622146451, 4662.207424737802, 4763.690360126598, 3881.941770873439, 4099.754014759109, 4708.128996135726, 4722.598579120779, 4782.234842425212, 4702.529747025287, 4711.081339138869, 4715.740634265114, 4739.952600474003, 4755.191617425046, 4508.797104130322, 4561.999999999984, 4692.906141877177, 4697.976510117462, 4743.786529606176, 3997.400389941503, 4009.799510024487, 4010.5187377514594, 4016.397540368968, 4018.718689691723, 6198.101275315099, 6251.437370636619, 6255.530835187379, 6260.311365749764, 6263.404976527268, 5468.6171967962255, 5472.616916815825, 5473.917891231635, 5478.671279723229, 5480.479354461319, 6792.76225332111, 6794.252632210453, 6819.897701534481, 6820.761273355459, 6826.556273842234, 4304.741715497049, 4489.236829738919, 4493.955060449386, 4494.258447356182, 4502.662300327489, 7125.7505987290715, 7225.349718525305, 7243.130824301117, 7246.058012458347, 7262.745803896838, 4513.480949690827, 4516.277395616686, 4526.773661316987, 4530.252508336153, 4534.8639540813165, 3936.271789718854, 4442.133783912106, 4553.7267763933605, 4587.105514424655, 4595.517470665532, 5438.9394068156325, 5440.809571664972, 5442.727863606804, 5454.290942177571, 5457.781688732406, 5173.922391164136, 6621.139251897319, 6882.380585747307, 6889.276625954303, 6896.137982752156, 1567.2085596773557, 1577.658989858634, 1591.896526725759, 1593.251171949182, 1594.5296137639425, 955.460165006769, 983.4050399508337, 1015.223354134088, 1020.7090979070929, 1038.6468600675807, 6425.036244563259, 6570.244421891448, 6587.341265873374, 6604.834879127964, 6610.735570577219, 7213.062301900719, 7231.385332246818, 7236.276372362827, 7246.5289756165685, 7259.818504537428, 5558.0, 6380.872382552323, 6545.509086818508, 6546.9017964730565, 6557.770478033246, 3736.8131593420762, 3792.2605092007348, 3793.317202903504, 3793.829277682511, 3796.8481260749813, 7167.319104685047, 7391.519551229153, 7403.18564957865, 7427.517211381243, 7440.069991251094, 7272.96363518179, 7355.117385913618, 7358.558486490828, 7367.668454919542, 7389.963050184715, 7509.812254693677, 7516.774496765215, 7525.4355923305975, 7540.3213710766295, 7541.170471248159, 6027.939720602913, 6319.0, 6886.24251332343, 7152.0, 7191.20896701352, 6953.4089602384365, 6990.986306985357, 6999.0, 7001.0198572198915, 7011.298870112948, 7380.483366164317, 7462.403007759258, 7471.178170401143, 7477.027986361738, 7507.136679281953, 4482.731036137711, 4538.455385353779, 4541.863744087683, 4546.090781843711, 4556.589906908394, 7125.251848555827, 7135.6432178391915, 7137.85724285501, 7143.85712285741, 7155.606441645759, 6568.408843204134, 6868.690908909011, 6879.724811007503, 6893.75871844483, 6904.378605925491, 5922.157364464994, 6611.173603299588, 6882.69027893756, 6895.310468953065, 6900.896486552806, 6723.966380168068, 6727.764528241488, 6743.022261772114, 6757.493188010821, 6759.357861003196, 6638.236602790741, 6881.174259088742, 6898.689558969758, 6905.827354316182, 6916.481263905127, 5846.655269288172, 6118.418750218722, 6621.801345959629, 6649.667516624246, 6814.386705196556], "unit": "score", "name": "prototype.html", "value": 4982.577976388096}, {"lowerIsBetter": false, "replicates": [586.4253032028612, 654.8231977366108, 689.5552368722174, 747.7382915979408, 756.8259300360916, 13067.477300907953, 15656.921715391436, 15663.295151718172, 15668.843311566881, 15683.215839208051, 14115.57653270401, 14229.075110117836, 14234.644133896658, 14261.286935653228, 14269.857301426982, 733.9596322202277, 745.9403247740195, 746.6789280609336, 747.543998161124, 903.1645727701866, 785.2579312549643, 816.542736067804, 852.1691350932853, 905.2034209895315, 928.9163975242227, 832.6169961817541, 962.8555716642489, 968.6270785747503, 973.9026097390275, 975.9167324270054, 780.0639232920518, 956.5695437053319, 964.1708131007329, 969.4667932637057, 972.154225823531, 666.1440049536371, 682.2597481732327, 728.1880703016099, 728.5300980867364, 730.5616630021998, 15186.392544298214, 15291.0, 15306.923465382713, 15308.0, 15318.617034574114, 12424.813627795591, 12486.625401237887, 12551.623451296477, 12703.301318427482, 13022.153560018663, 9747.0, 10059.295849290553, 10127.442990635513, 10173.389596624153, 10478.266521343508, 3477.9130521736906, 3525.1892064825233, 3553.680168784822, 3566.625504322061, 3631.5823680276576, 84782.57608711979, 86033.13966860314, 86261.56869215677, 86308.0, 86459.0, 9612.0, 9626.855597166048, 9679.467629280458, 9916.900830991743, 10470.057694807503, 18487.53781155455, 18647.720284195748, 22568.54862902733, 22598.887005565197, 22635.094596215968, 7515.398768098539, 7560.470767046364, 7578.469507134448, 7635.465517413728, 7774.378049756006, 4088.4276201331836, 4153.7300075494995, 4154.813033413504, 4156.43888075112, 4159.147374788161, 3586.300671369058, 3630.1650620356936, 3650.233450975272, 3654.0682126057686, 3656.7074634029746, 630.7256343490596, 667.8063361625171, 690.8134803602999, 714.7748459235428, 718.3140101203338, 564.2016546586534, 575.3814649252071, 588.808637192914, 601.6029420582395, 627.4227710506345, 7996.72011479607, 8042.155573664681, 8127.431079824356, 8191.918080819235, 8298.294644955125, 568.4315684315684, 593.5815250248564, 612.5008118383503, 613.0191693290699, 634.4321831960369, 3638.581563120275, 3780.4140358244517, 3826.1773718650625, 3876.9418458723144, 3977.76133431995, 88189.0, 88681.55659221663, 88730.0, 89054.55472722594, 89595.55202223947, 72999.0, 73784.63107684534, 75362.0, 78318.6084069576, 80270.59864700756, 69218.0, 69224.30775692179, 69444.0, 69943.65028174827, 70428.94356584655, 6601.075849380994, 7380.963095184705, 7550.509216900884, 7817.843643126992, 8008.799780005546, 38445.0, 48949.5105048945, 49438.0, 49529.50470495249, 49620.0, 66119.0, 67499.3250067493, 68172.659136704, 68327.97508037284, 68786.62426751538, 9814.75463113428, 9998.800023999625, 10176.694699159038, 10297.970202979643, 10850.186236032172, 10914.672559823219, 11109.944450277697, 11156.721081973015, 11469.713257168638, 11496.88503114958, 8521.147885211429, 8697.130286971253, 10401.791964160826, 10409.42748148859, 10757.0, 8976.41653292534, 9014.414063085878, 9035.141661542142, 9307.11582399671, 9342.906570934203, 10126.291159618757, 10150.54322555472, 10154.035366640157, 10210.948945255226, 11042.116630669689, 8570.871436928575, 8613.353998450017, 8643.725097627193, 8881.333899957399, 9595.904040959502, 8595.957020214859, 8715.0, 8721.912780872364, 8825.073367296598, 8983.955080224558], "unit": "score", "name": "yui.html", "value": 6720.924482770507}], "name": "dromaeo_css", "value": 7504.2780117280445}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [104.0, 105.0, 110.0, 111.0, 109.0, 110.0, 113.0, 109.0, 113.0, 111.0], "unit": "score", "name": "ai-astar", "value": 109.5}, {"lowerIsBetter": true, "replicates": [155.0, 122.0, 141.0, 159.0, 120.0, 139.0, 140.0, 118.0, 157.0, 117.0], "unit": "score", "name": "audio-beat-detection", "value": 136.8}, {"lowerIsBetter": true, "replicates": [182.0, 187.0, 188.0, 256.0, 211.0, 182.0, 184.0, 187.0, 181.0, 181.0], "unit": "score", "name": "audio-dft", "value": 193.9}, {"lowerIsBetter": true, "replicates": [77.0, 75.0, 72.0, 114.0, 55.0, 60.0, 57.0, 63.0, 121.0, 56.0], "unit": "score", "name": "audio-fft", "value": 75.0}, {"lowerIsBetter": true, "replicates": [91.0, 94.0, 128.0, 81.0, 78.0, 88.0, 120.0, 76.0, 80.0, 116.0], "unit": "score", "name": "audio-oscillator", "value": 95.2}, {"lowerIsBetter": true, "replicates": [87.0, 83.0, 87.0, 84.0, 88.0, 83.0, 87.0, 84.0, 87.0, 84.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 85.4}, {"lowerIsBetter": true, "replicates": [92.0, 94.0, 93.0, 93.0, 94.0, 92.0, 94.0, 95.0, 103.0, 149.0], "unit": "score", "name": "imaging-darkroom", "value": 99.9}, {"lowerIsBetter": true, "replicates": [87.0, 86.0, 85.0, 85.0, 86.0, 87.0, 103.0, 142.0, 141.0, 87.0], "unit": "score", "name": "imaging-desaturate", "value": 98.9}, {"lowerIsBetter": true, "replicates": [56.0, 56.0, 56.0, 53.0, 54.0, 53.0, 54.0, 63.0, 56.0, 53.0], "unit": "score", "name": "json-parse-financial", "value": 55.4}, {"lowerIsBetter": true, "replicates": [66.0, 64.0, 70.0, 76.0, 78.0, 74.0, 71.0, 67.0, 67.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 70.0}, {"lowerIsBetter": true, "replicates": [83.0, 83.0, 83.0, 84.0, 84.0, 82.0, 83.0, 82.0, 84.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 83.2}, {"lowerIsBetter": true, "replicates": [131.0, 120.0, 122.0, 124.0, 116.0, 120.0, 120.0, 122.0, 130.0, 118.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 122.3}, {"lowerIsBetter": true, "replicates": [140.0, 140.0, 138.0, 138.0, 139.0, 126.0, 138.0, 138.0, 137.0, 138.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 137.2}, {"lowerIsBetter": true, "replicates": [66.0, 66.0, 67.0, 70.0, 95.0, 92.0, 92.0, 83.0, 83.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 78.1}], "name": "kraken", "value": 1440.8}]} 17:48:45 INFO - Return code: 0 17:48:45 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 17:48:45 ERROR - # TBPL SUCCESS # 17:48:45 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 17:48:45 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 17:48:45 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 17:48:45 INFO - 2016-03-16 17:48:45.718 screenresolution[1679:9571] starting screenresolution argv=screenresolution get 17:48:45 INFO - 2016-03-16 17:48:45.721 screenresolution[1679:9571] Display 0: 1600x1200x32@60 17:48:45 INFO - 2016-03-16 17:48:45.727 screenresolution[1680:9574] starting screenresolution argv=screenresolution list 17:48:45 INFO - Available Modes on Display 0 17:48:45 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 17:48:45 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 17:48:45 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 17:48:45 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 17:48:45 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 17:48:45 INFO - Intel Iris: 17:48:45 INFO - Chipset Model: Intel Iris 17:48:45 INFO - Type: GPU 17:48:45 INFO - Bus: Built-In 17:48:45 INFO - VRAM (Dynamic, Max): 1536 MB 17:48:45 INFO - Vendor: Intel (0x8086) 17:48:45 INFO - Device ID: 0x0a2e 17:48:45 INFO - Revision ID: 0x0009 17:48:45 INFO - Displays: 17:48:45 INFO - Display: 17:48:45 INFO - Resolution: 1600 x 1200 @ 60 Hz 17:48:45 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 17:48:45 INFO - Display Serial Number: 1600x1200 60 17:48:45 INFO - Main Display: Yes 17:48:45 INFO - Mirror: Off 17:48:45 INFO - Online: Yes 17:48:45 INFO - Rotation: Supported 17:48:45 INFO - Return code: 0 17:48:45 INFO - Running post-action listener: _resource_record_post_action 17:48:45 INFO - Running post-run listener: _resource_record_post_run 17:48:47 INFO - Total resource usage - Wall time: 1206s; CPU: 53.0%; Read bytes: 39458304; Write bytes: 705157632; Read time: 504; Write time: 1994 17:48:47 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 402627072; Write bytes: 403150336; Read time: 30259; Write time: 729 17:48:47 INFO - run-tests - Wall time: 1173s; CPU: 53.0%; Read bytes: 37639680; Write bytes: 299990528; Read time: 485; Write time: 1242 17:48:47 INFO - Running post-run listener: _upload_blobber_files 17:48:47 INFO - Blob upload gear active. 17:48:47 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:48:47 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 17:48:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 17:48:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 17:48:47 INFO - (blobuploader) - INFO - Open directory for files ... 17:48:47 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 17:48:47 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:48:47 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:48:48 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 17:48:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:48:48 INFO - (blobuploader) - INFO - Done attempting. 17:48:48 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 17:48:48 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:48:48 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:48:49 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 17:48:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:48:49 INFO - (blobuploader) - INFO - Done attempting. 17:48:49 INFO - (blobuploader) - INFO - Iteration through files over. 17:48:49 INFO - Return code: 0 17:48:49 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:48:49 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:48:49 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8e953d252cc2d990a1e5c0a8af8900c5a5ee96898487e4959e5c7977875dc4e87ca7b1dbe6f2be15765ab261aae4024924b342e5ee9c1b1cd2abb299a4eccb5a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b10087bfda0d0737bb924bf33eade40780b813d1820c0c16e10b6b24485f0a45a5233dba3ad999a3be76ec040e2bf9e4da193ddcf1f502f103424dc4baa2de12"} 17:48:49 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:48:49 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:48:49 INFO - Contents: 17:48:49 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8e953d252cc2d990a1e5c0a8af8900c5a5ee96898487e4959e5c7977875dc4e87ca7b1dbe6f2be15765ab261aae4024924b342e5ee9c1b1cd2abb299a4eccb5a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b10087bfda0d0737bb924bf33eade40780b813d1820c0c16e10b6b24485f0a45a5233dba3ad999a3be76ec040e2bf9e4da193ddcf1f502f103424dc4baa2de12"} 17:48:49 INFO - Running post-run listener: copy_logs_to_upload_dir 17:48:49 INFO - Copying logs to upload dir... 17:48:49 INFO - mkdir: /builds/slave/test/build/upload/logs 17:48:49 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1262.334662 ========= master_lag: 0.44 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 2 secs) (at 2016-03-16 17:48:49.528934) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-16 17:48:49.530070) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ASGG6vEBxG/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test/properties RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners TMPDIR=/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8e953d252cc2d990a1e5c0a8af8900c5a5ee96898487e4959e5c7977875dc4e87ca7b1dbe6f2be15765ab261aae4024924b342e5ee9c1b1cd2abb299a4eccb5a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b10087bfda0d0737bb924bf33eade40780b813d1820c0c16e10b6b24485f0a45a5233dba3ad999a3be76ec040e2bf9e4da193ddcf1f502f103424dc4baa2de12"} build_url:https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010970 build_url: 'https://queue.taskcluster.net/v1/task/fNU_DIP1S9ev9DteruO8Dw/artifacts/public/build/firefox-48.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8e953d252cc2d990a1e5c0a8af8900c5a5ee96898487e4959e5c7977875dc4e87ca7b1dbe6f2be15765ab261aae4024924b342e5ee9c1b1cd2abb299a4eccb5a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/b10087bfda0d0737bb924bf33eade40780b813d1820c0c16e10b6b24485f0a45a5233dba3ad999a3be76ec040e2bf9e4da193ddcf1f502f103424dc4baa2de12"}' ========= master_lag: 0.03 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-16 17:48:49.570734) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 6 secs) (at 2016-03-16 17:48:49.571043) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.ASGG6vEBxG/Render GIT_SHARE_BASE_DIR=/builds/git-shared HG_SHARE_BASE_DIR=/builds/hg-shared HOME=/Users/cltbld IDLEIZER_DISABLE_SHUTDOWN=true LOGNAME=cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NO_EM_RESTART=1 PAGER=/bin/cat PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11 PWD=/builds/slave/test RUNNER_CONFIG_CMD=/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg SHELL=/bin/bash SSH_AUTH_SOCK=/private/tmp/com.apple.launchd.o0NB7p4qbA/Listeners TMPDIR=/var/folders/rl/_gz3yxcs4s1f_08bbj7xmf7w00000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.005267 ========= master_lag: 6.60 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 6 secs) (at 2016-03-16 17:48:56.172038) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-16 17:48:56.172310) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-16 17:48:56.197194) ========= ========= Total master_lag: 7.24 =========