builder: fx-team_yosemite_test-dromaeojs slave: t-yosemite-r5-0004 starttime: 1446769333.87 results: success (0) buildid: 20151105140536 builduid: 62764bd1e0604ad39b4b8cc6681bf17d revision: 319e09c9668b8d2937c49dabdfd84a30d8771ac1 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:13.872519) ========= master: http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:13.872985) ========= ========= Started set props: basedir (results: 0, elapsed: 5 secs) (at 2015-11-05 16:22:13.873309) ========= 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.jXp44zOcdH/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.tp4DB8h2wj/Listeners TMPDIR=/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/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:0x0:0x0 using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.005961 basedir: '/builds/slave/test' ========= master_lag: 5.05 ========= ========= Finished set props: basedir (results: 0, elapsed: 5 secs) (at 2015-11-05 16:22:18.927009) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2015-11-05 16:22:18.927487) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2015-11-05 16:22:19.979576) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:19.979969) ========= 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.jXp44zOcdH/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.tp4DB8h2wj/Listeners TMPDIR=/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.005281 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:20.022130) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:20.022470) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:20.022877) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:20.023183) ========= 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.jXp44zOcdH/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.tp4DB8h2wj/Listeners TMPDIR=/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/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:0x0:0x0 using PTY: False --2015-11-05 16:22:20-- 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% 5.84M=0.002s 2015-11-05 16:22:20 (5.84 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.114896 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:20.158422) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:20.158773) ========= 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.jXp44zOcdH/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.tp4DB8h2wj/Listeners TMPDIR=/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.020145 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:20.208063) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:20.208445) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 319e09c9668b8d2937c49dabdfd84a30d8771ac1 --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 319e09c9668b8d2937c49dabdfd84a30d8771ac1 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.jXp44zOcdH/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.tp4DB8h2wj/Listeners TMPDIR=/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/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:0x0:0x0 using PTY: False 2015-11-05 16:22:20,284 truncating revision to first 12 chars 2015-11-05 16:22:20,285 Setting DEBUG logging. 2015-11-05 16:22:20,285 attempt 1/10 2015-11-05 16:22:20,285 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/319e09c9668b?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-05 16:22:20,763 unpacking tar archive at: fx-team-319e09c9668b/testing/mozharness/ program finished with exit code 0 elapsedTime=0.723616 ========= master_lag: 0.07 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:21.000358) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:21.000708) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:21.019130) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:21.019477) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-05 16:22:21.019915) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 37 secs) (at 2015-11-05 16:22:21.020205) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --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', '--system-bits', '64', '--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.jXp44zOcdH/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.tp4DB8h2wj/Listeners TMPDIR=/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/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:0x0:0x0 using PTY: False 16:22:21 INFO - MultiFileLogger online at 20151105 16:22:21 in /builds/slave/test 16:22:21 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 16:22:21 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:22:21 INFO - {'append_to_log': False, 16:22:21 INFO - 'base_work_dir': '/builds/slave/test', 16:22:21 INFO - 'blob_upload_branch': 'Fx-Team', 16:22:21 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:22:21 INFO - 'branch': 'Fx-Team', 16:22:21 INFO - 'buildbot_json_path': 'buildprops.json', 16:22:21 INFO - 'config_files': ('talos/mac_config.py',), 16:22:21 INFO - 'default_actions': ('clobber', 16:22:21 INFO - 'read-buildbot-config', 16:22:21 INFO - 'download-and-extract', 16:22:21 INFO - 'populate-webroot', 16:22:21 INFO - 'create-virtualenv', 16:22:21 INFO - 'install', 16:22:21 INFO - 'run-tests'), 16:22:21 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:22:21 INFO - 'download_minidump_stackwalk': True, 16:22:21 INFO - 'download_symbols': 'ondemand', 16:22:21 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:22:21 INFO - 'tooltool.py': '/tools/tooltool.py', 16:22:21 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:22:21 INFO - '/tools/misc-python/virtualenv.py')}, 16:22:21 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:22:21 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:22:21 INFO - 'installer_path': 'installer.exe', 16:22:21 INFO - 'log_level': 'info', 16:22:21 INFO - 'log_name': 'talos', 16:22:21 INFO - 'log_to_console': True, 16:22:21 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 16:22:21 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 16:22:21 INFO - 'opt_config_files': (), 16:22:21 INFO - 'pip_index': False, 16:22:21 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 16:22:21 INFO - 'cmd': ('bash', 16:22:21 INFO - '-c', 16:22:21 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 16:22:21 INFO - 'enabled': True, 16:22:21 INFO - 'halt_on_failure': False, 16:22:21 INFO - 'name': 'check_screen_resolution'},), 16:22:21 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 16:22:21 INFO - 'cmd': ('bash', 16:22:21 INFO - '-c', 16:22:21 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 16:22:21 INFO - 'enabled': True, 16:22:21 INFO - 'halt_on_failure': False, 16:22:21 INFO - 'name': 'check_screen_resolution'},), 16:22:21 INFO - 'run_cmd_checks_enabled': True, 16:22:21 INFO - 'sps_profile': False, 16:22:21 INFO - 'sps_profile_interval': 0, 16:22:21 INFO - 'suite': 'dromaeojs', 16:22:21 INFO - 'system_bits': '64', 16:22:21 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:22:21 INFO - 'title': 't-yosemite-r5-0004', 16:22:21 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:22:21 INFO - 'use_talos_json': True, 16:22:21 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:22:21 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:22:21 INFO - 'work_dir': 'build'} 16:22:21 INFO - ##### 16:22:21 INFO - ##### Running clobber step. 16:22:21 INFO - ##### 16:22:21 INFO - Running pre-action listener: _resource_record_pre_action 16:22:21 INFO - Running main action method: clobber 16:22:21 INFO - rmtree: /builds/slave/test/build 16:22:21 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:22:25 INFO - Running post-action listener: _resource_record_post_action 16:22:25 INFO - ##### 16:22:25 INFO - ##### Running read-buildbot-config step. 16:22:25 INFO - ##### 16:22:25 INFO - Running pre-action listener: _resource_record_pre_action 16:22:25 INFO - Running main action method: read_buildbot_config 16:22:25 INFO - Using buildbot properties: 16:22:25 INFO - { 16:22:25 INFO - "properties": { 16:22:25 INFO - "buildnumber": 1209, 16:22:25 INFO - "product": "firefox", 16:22:25 INFO - "script_repo_revision": "production", 16:22:25 INFO - "builddir": "fx-team_yosemite_test-dromaeojs", 16:22:25 INFO - "repository": "", 16:22:25 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 fx-team talos dromaeojs", 16:22:25 INFO - "buildid": "20151105140536", 16:22:25 INFO - "slavename": "t-yosemite-r5-0004", 16:22:25 INFO - "pgo_build": "False", 16:22:25 INFO - "basedir": "/builds/slave/test", 16:22:25 INFO - "project": "", 16:22:25 INFO - "platform": "yosemite", 16:22:25 INFO - "master": "http://buildbot-master106.bb.releng.scl3.mozilla.com:8201/", 16:22:25 INFO - "slavebuilddir": "test", 16:22:25 INFO - "scheduler": "tests-fx-team-macosx64-talos", 16:22:25 INFO - "branch": "fx-team", 16:22:25 INFO - "repo_path": "integration/fx-team", 16:22:25 INFO - "stage_platform": "macosx64", 16:22:25 INFO - "builduid": "62764bd1e0604ad39b4b8cc6681bf17d", 16:22:25 INFO - "revision": "319e09c9668b8d2937c49dabdfd84a30d8771ac1" 16:22:25 INFO - }, 16:22:25 INFO - "sourcestamp": { 16:22:25 INFO - "repository": "", 16:22:25 INFO - "hasPatch": false, 16:22:25 INFO - "project": "", 16:22:25 INFO - "branch": "fx-team-macosx64-talos", 16:22:25 INFO - "changes": [ 16:22:25 INFO - { 16:22:25 INFO - "category": null, 16:22:25 INFO - "files": [ 16:22:25 INFO - { 16:22:25 INFO - "url": null, 16:22:25 INFO - "name": "https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 16:22:25 INFO - } 16:22:25 INFO - ], 16:22:25 INFO - "repository": "", 16:22:25 INFO - "rev": "319e09c9668b8d2937c49dabdfd84a30d8771ac1", 16:22:25 INFO - "who": "nalexander@mozilla.com", 16:22:25 INFO - "when": 1446767044, 16:22:25 INFO - "number": 6627370, 16:22:25 INFO - "comments": "Bug 1220887 - Make 'base' Gradle project in the srcdir. r=sebastian\n\nThis is the last Gradle project that isn't in the srcdir. Since base/\ndoesn't have the correct package prefix directory structure, we still\nneed to symlink, but we only need one link. This effectively\ndeprecates |mach gradle-install|.\n\nThis should improve the robustness of our Gradle configuration,\nensuring that we always have projects to import. Since\nsettings.gradle executes very early in the IDE import project\nsequence: before Gradle project evaluation time, and thus before any\nGradle task is executed, we should always see a complete project. (It\nwas possible to see incomplete Gradle configurations if |mach\ngradle-install| hadn't been run at just the right time.)", 16:22:25 INFO - "project": "", 16:22:25 INFO - "at": "Thu 05 Nov 2015 15:44:04", 16:22:25 INFO - "branch": "fx-team-macosx64-talos", 16:22:25 INFO - "revlink": "", 16:22:25 INFO - "properties": [ 16:22:25 INFO - [ 16:22:25 INFO - "buildid", 16:22:25 INFO - "20151105140536", 16:22:25 INFO - "Change" 16:22:25 INFO - ], 16:22:25 INFO - [ 16:22:25 INFO - "builduid", 16:22:25 INFO - "62764bd1e0604ad39b4b8cc6681bf17d", 16:22:25 INFO - "Change" 16:22:25 INFO - ], 16:22:25 INFO - [ 16:22:25 INFO - "pgo_build", 16:22:25 INFO - "False", 16:22:25 INFO - "Change" 16:22:25 INFO - ] 16:22:25 INFO - ], 16:22:25 INFO - "revision": "319e09c9668b8d2937c49dabdfd84a30d8771ac1" 16:22:25 INFO - } 16:22:25 INFO - ], 16:22:25 INFO - "revision": "319e09c9668b8d2937c49dabdfd84a30d8771ac1" 16:22:25 INFO - } 16:22:25 INFO - } 16:22:25 INFO - Found installer url https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 16:22:25 INFO - Running post-action listener: _resource_record_post_action 16:22:25 INFO - ##### 16:22:25 INFO - ##### Running download-and-extract step. 16:22:25 INFO - ##### 16:22:25 INFO - Running pre-action listener: _resource_record_pre_action 16:22:25 INFO - Running main action method: download_and_extract 16:22:25 INFO - mkdir: /builds/slave/test/build/tests 16:22:25 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')]} 16:22:25 INFO - https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 16:22:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/test_packages.json 16:22:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/test_packages.json 16:22:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 16:22:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 16:22:26 INFO - Downloaded 1149 bytes. 16:22:26 INFO - Reading from file /builds/slave/test/build/test_packages.json 16:22:26 INFO - Using the following test package requirements: 16:22:26 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 16:22:26 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:22:26 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 16:22:26 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:22:26 INFO - u'jsshell-mac.zip'], 16:22:26 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:22:26 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 16:22:26 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 16:22:26 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:22:26 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 16:22:26 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:22:26 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 16:22:26 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:22:26 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 16:22:26 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 16:22:26 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 16:22:26 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 16:22:26 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 16:22: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')]} 16:22:26 INFO - https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 16:22:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:22:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:22:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:22:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 16:22:27 INFO - Downloaded 17458889 bytes. 16:22:27 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 16:22:27 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:22:27 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 16:22:31 INFO - Return code: 0 16:22:31 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip', u'firefox-45.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 16:22: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')]} 16:22:31 INFO - https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 16:22:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:22:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:22:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:22:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'}, attempt #1 16:22:33 INFO - Downloaded 17458889 bytes. 16:22:33 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] in /builds/slave/test/build/tests 16:22:33 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 16:22:33 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 16:22:38 INFO - Return code: 0 16:22:38 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')]} 16:22:38 INFO - https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 16:22:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 16:22:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 16:22:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 16:22:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'}, attempt #1 16:22:39 INFO - Downloaded 11131307 bytes. 16:22:39 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] in /builds/slave/test/build/tests 16:22:39 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 16:22:39 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 16:22:40 INFO - Return code: 0 16:22:40 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')]} 16:22:40 INFO - https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 16:22:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 16:22:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 16:22:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 16:22:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg'}, attempt #1 16:22:43 INFO - Downloaded 108674862 bytes. 16:22:43 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 16:22:43 INFO - mkdir: /builds/slave/test/properties 16:22:43 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:22:43 INFO - Writing to file /builds/slave/test/properties/build_url 16:22:43 INFO - Contents: 16:22:43 INFO - build_url:https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 16:22:43 INFO - Running post-action listener: _resource_record_post_action 16:22:43 INFO - Running post-action listener: set_extra_try_arguments 16:22:43 INFO - ##### 16:22:43 INFO - ##### Running populate-webroot step. 16:22:43 INFO - ##### 16:22:43 INFO - Running pre-action listener: _resource_record_pre_action 16:22:43 INFO - Running main action method: populate_webroot 16:22:43 INFO - Guessing talos json url... 16:22:43 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')]} 16:22:43 INFO - https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.txt matches https://queue.taskcluster.net 16:22:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 16:22:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.txt 16:22:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.txt to /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 16:22:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.txt', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.mac.txt'}, attempt #1 16:22:43 INFO - Downloaded 103 bytes. 16:22:43 INFO - Reading from file /builds/slave/test/build/firefox-45.0a1.en-US.mac.txt 16:22:43 INFO - Contents: 16:22:43 INFO - 20151105140536 16:22:43 INFO - https://hg.mozilla.org/integration/fx-team/rev/319e09c9668b8d2937c49dabdfd84a30d8771ac1 16:22:43 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')]} 16:22:43 INFO - trying https://hg.mozilla.org/integration/fx-team/raw-file/319e09c966/testing/talos/talos.json 16:22:43 INFO - Downloading https://hg.mozilla.org/integration/fx-team/raw-file/319e09c966/testing/talos/talos.json to /builds/slave/test/build/talos.json 16:22:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://hg.mozilla.org/integration/fx-team/raw-file/319e09c966/testing/talos/talos.json', 'file_name': '/builds/slave/test/build/talos.json'}, attempt #1 16:22:44 INFO - Downloaded 4264 bytes. 16:22:44 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:22:44 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:22:44 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 16:22:44 INFO - '../fennec_ids.txt'], 16:22:44 INFO - 'tests': ['tcheck2']}, 16:22:44 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:22:44 INFO - '--tppagecycles', 16:22:44 INFO - '7'], 16:22:44 INFO - 'tests': ['tsvgm']}}, 16:22:44 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 16:22:44 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 16:22:44 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:22:44 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 16:22:44 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 16:22:44 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 16:22:44 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:22:44 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:22:44 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:22:44 INFO - 'talos_options': ['--e10s'], 16:22:44 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:22:44 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:22:44 INFO - 'tests': ['damp', 'tps']}, 16:22:44 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:22:44 INFO - 'talos_options': ['--e10s'], 16:22:44 INFO - 'tests': ['damp', 'tps']}, 16:22:44 INFO - 'g3': {'tests': ['dromaeo_dom']}, 16:22:44 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:22:44 INFO - 'other': {'tests': ['a11yr', 16:22:44 INFO - 'ts_paint', 16:22:44 INFO - 'tpaint', 16:22:44 INFO - 'sessionrestore', 16:22:44 INFO - 'sessionrestore_no_auto_restore']}, 16:22:44 INFO - 'other-e10s': {'talos_options': ['--e10s'], 16:22:44 INFO - 'tests': ['a11yr', 16:22:44 INFO - 'ts_paint', 16:22:44 INFO - 'tpaint', 16:22:44 INFO - 'sessionrestore', 16:22:44 INFO - 'sessionrestore_no_auto_restore']}, 16:22:44 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 16:22:44 INFO - 'tests': ['a11yr', 16:22:44 INFO - 'ts_paint', 16:22:44 INFO - 'tpaint', 16:22:44 INFO - 'sessionrestore', 16:22:44 INFO - 'sessionrestore_no_auto_restore']}, 16:22:44 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 16:22:44 INFO - 'tests': ['a11yr', 16:22:44 INFO - 'ts_paint', 16:22:44 INFO - 'tpaint', 16:22:44 INFO - 'sessionrestore', 16:22:44 INFO - 'sessionrestore_no_auto_restore']}, 16:22:44 INFO - 'other_l64': {'tests': ['a11yr', 16:22:44 INFO - 'ts_paint', 16:22:44 INFO - 'tpaint', 16:22:44 INFO - 'sessionrestore', 16:22:44 INFO - 'sessionrestore_no_auto_restore']}, 16:22:44 INFO - 'other_nol64': {'tests': ['a11yr', 16:22:44 INFO - 'ts_paint', 16:22:44 INFO - 'tpaint', 16:22:44 INFO - 'sessionrestore', 16:22:44 INFO - 'sessionrestore_no_auto_restore']}, 16:22:44 INFO - 'svgr': {'tests': ['tsvgx', 16:22:44 INFO - 'tsvgr_opacity', 16:22:44 INFO - 'tart', 16:22:44 INFO - 'tscrollx', 16:22:44 INFO - 'cart']}, 16:22:44 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 16:22:44 INFO - 'tests': ['tsvgx', 16:22:44 INFO - 'tsvgr_opacity', 16:22:44 INFO - 'tart', 16:22:44 INFO - 'tscrollx', 16:22:44 INFO - 'cart']}, 16:22:44 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:22:44 INFO - 'tests': ['tp5o']}, 16:22:44 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:22:44 INFO - 'talos_options': ['--e10s'], 16:22:44 INFO - 'tests': ['tp5o']}, 16:22:44 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:22:44 INFO - 'talos_options': ['--xperf_path', 16:22:44 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:22:44 INFO - 'tests': ['tp5n']}, 16:22:44 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:22:44 INFO - 'talos_options': ['--e10s', 16:22:44 INFO - '--xperf_path', 16:22:44 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"', 16:22:44 INFO - 'C:/slave/talos-data/talos/xperf.config'], 16:22:44 INFO - 'tests': ['tp5n']}}, 16:22:44 INFO - 'talos.zip': {'path': '', 16:22:44 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:22:44 INFO - Running post-action listener: _resource_record_post_action 16:22:44 INFO - ##### 16:22:44 INFO - ##### Running create-virtualenv step. 16:22:44 INFO - ##### 16:22:44 INFO - Running pre-action listener: _resource_record_pre_action 16:22:44 INFO - Running main action method: create_virtualenv 16:22:44 INFO - Creating virtualenv /builds/slave/test/build/venv 16:22:44 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 16:22:44 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:22:44 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:22:44 INFO - Using real prefix '/tools/python27' 16:22:44 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:22:45 INFO - Installing distribute.............................................................................................................................................................................................done. 16:22:49 INFO - Installing pip.................done. 16:22:49 INFO - Return code: 0 16:22:49 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:22:49 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')]} 16:22:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:22:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:22:49 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')]} 16:22:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:22:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:22:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x1028d0a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10293d228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb850d4a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1028859f0>, '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 0x1025e4cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10284f990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/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.tp4DB8h2wj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 16:22:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 16:22:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 16:22:49 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/Render', 16:22:49 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:22:49 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:22:49 INFO - 'HOME': '/Users/cltbld', 16:22:49 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:22:49 INFO - 'LOGNAME': 'cltbld', 16:22:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:22:49 INFO - 'MOZ_NO_REMOTE': '1', 16:22:49 INFO - 'NO_EM_RESTART': '1', 16:22:49 INFO - 'PAGER': '/bin/cat', 16:22:49 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:22:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:22:49 INFO - 'PWD': '/builds/slave/test', 16:22:49 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:22:49 INFO - 'SHELL': '/bin/bash', 16:22:49 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.tp4DB8h2wj/Listeners', 16:22:49 INFO - 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', 16:22:49 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:22:49 INFO - 'USER': 'cltbld', 16:22:49 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:22:49 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:22:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:22:49 INFO - 'XPC_FLAGS': '0x0', 16:22:49 INFO - 'XPC_SERVICE_NAME': '0', 16:22:49 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:22:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:22:49 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 16:22:49 INFO - Cleaning up... 16:22:49 INFO - Return code: 0 16:22:49 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 16:22:49 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')]} 16:22:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:22:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:22:49 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')]} 16:22:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:22:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:22:49 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x1028d0a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10293d228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb850d4a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1028859f0>, '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 0x1025e4cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10284f990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/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.tp4DB8h2wj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 16:22:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 16:22:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 16:22:49 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/Render', 16:22:49 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:22:49 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:22:49 INFO - 'HOME': '/Users/cltbld', 16:22:49 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:22:49 INFO - 'LOGNAME': 'cltbld', 16:22:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:22:49 INFO - 'MOZ_NO_REMOTE': '1', 16:22:49 INFO - 'NO_EM_RESTART': '1', 16:22:49 INFO - 'PAGER': '/bin/cat', 16:22:49 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:22:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:22:49 INFO - 'PWD': '/builds/slave/test', 16:22:49 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:22:49 INFO - 'SHELL': '/bin/bash', 16:22:49 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.tp4DB8h2wj/Listeners', 16:22:49 INFO - 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', 16:22:49 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:22:49 INFO - 'USER': 'cltbld', 16:22:49 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:22:49 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:22:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:22:49 INFO - 'XPC_FLAGS': '0x0', 16:22:49 INFO - 'XPC_SERVICE_NAME': '0', 16:22:49 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:22:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:22:49 INFO - Downloading/unpacking psutil>=0.7.1 16:22:49 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 16:22:49 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 16:22:49 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 16:22:49 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 16:22:49 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 16:22:49 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 16:22:51 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 16:22:52 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 16:22:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:22:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:22:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:22:52 INFO - Installing collected packages: psutil 16:22:52 INFO - Running setup.py install for psutil 16:22:52 INFO - building 'psutil._psutil_osx' extension 16:22:52 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 16:22:52 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 16:22:52 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 16:22:52 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 16:22:52 INFO - building 'psutil._psutil_posix' extension 16:22:52 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 16:22:52 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 16:22:52 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 16:22:52 INFO - ^ 16:22:52 INFO - 1 warning generated. 16:22:52 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 16:22:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:22:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:22:53 INFO - Successfully installed psutil 16:22:53 INFO - Cleaning up... 16:22:53 INFO - Return code: 0 16:22:53 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 16:22:53 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')]} 16:22:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:22:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:22:53 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')]} 16:22:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:22:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:22:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x1028d0a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10293d228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb850d4a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1028859f0>, '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 0x1025e4cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10284f990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/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.tp4DB8h2wj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 16:22:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 16:22:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 16:22:53 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/Render', 16:22:53 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:22:53 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:22:53 INFO - 'HOME': '/Users/cltbld', 16:22:53 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:22:53 INFO - 'LOGNAME': 'cltbld', 16:22:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:22:53 INFO - 'MOZ_NO_REMOTE': '1', 16:22:53 INFO - 'NO_EM_RESTART': '1', 16:22:53 INFO - 'PAGER': '/bin/cat', 16:22:53 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:22:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:22:53 INFO - 'PWD': '/builds/slave/test', 16:22:53 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:22:53 INFO - 'SHELL': '/bin/bash', 16:22:53 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.tp4DB8h2wj/Listeners', 16:22:53 INFO - 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', 16:22:53 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:22:53 INFO - 'USER': 'cltbld', 16:22:53 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:22:53 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:22:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:22:53 INFO - 'XPC_FLAGS': '0x0', 16:22:53 INFO - 'XPC_SERVICE_NAME': '0', 16:22:53 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:22:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:22:53 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 16:22:53 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 16:22:53 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 16:22:53 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 16:22:53 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 16:22:53 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 16:22:53 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 16:22:55 INFO - Downloading mozsystemmonitor-0.0.tar.gz 16:22:55 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 16:22:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:22:55 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 16:22:55 INFO - Installing collected packages: mozsystemmonitor 16:22:55 INFO - Running setup.py install for mozsystemmonitor 16:22:56 INFO - Successfully installed mozsystemmonitor 16:22:56 INFO - Cleaning up... 16:22:56 INFO - Return code: 0 16:22:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:22:56 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')]} 16:22:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:22:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:22:56 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')]} 16:22:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:22:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:22:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x1028d0a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10293d228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb850d4a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1028859f0>, '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 0x1025e4cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10284f990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/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.tp4DB8h2wj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 16:22:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 16:22:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 16:22:56 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/Render', 16:22:56 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:22:56 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:22:56 INFO - 'HOME': '/Users/cltbld', 16:22:56 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:22:56 INFO - 'LOGNAME': 'cltbld', 16:22:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:22:56 INFO - 'MOZ_NO_REMOTE': '1', 16:22:56 INFO - 'NO_EM_RESTART': '1', 16:22:56 INFO - 'PAGER': '/bin/cat', 16:22:56 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:22:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:22:56 INFO - 'PWD': '/builds/slave/test', 16:22:56 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:22:56 INFO - 'SHELL': '/bin/bash', 16:22:56 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.tp4DB8h2wj/Listeners', 16:22:56 INFO - 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', 16:22:56 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:22:56 INFO - 'USER': 'cltbld', 16:22:56 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:22:56 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:22:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:22:56 INFO - 'XPC_FLAGS': '0x0', 16:22:56 INFO - 'XPC_SERVICE_NAME': '0', 16:22:56 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:22:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:22:56 INFO - Downloading/unpacking blobuploader==1.2.4 16:22:56 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 16:22:56 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 16:22:56 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 16:22:56 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 16:22:56 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 16:22:56 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 16:22:58 INFO - Downloading blobuploader-1.2.4.tar.gz 16:22:58 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 16:22:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:22:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:22:58 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 16:22:58 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 16:22:58 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 16:22:58 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 16:22:58 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 16:22:58 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 16:22:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 16:22:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:22:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:22:59 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 16:22:59 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 16:22:59 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 16:22:59 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 16:22:59 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 16:22:59 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 16:22:59 INFO - Downloading docopt-0.6.1.tar.gz 16:22:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 16:22:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:22:59 INFO - Installing collected packages: blobuploader, requests, docopt 16:22:59 INFO - Running setup.py install for blobuploader 16:22:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:23:00 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:23:00 INFO - Running setup.py install for requests 16:23:00 INFO - Running setup.py install for docopt 16:23:00 INFO - Successfully installed blobuploader requests docopt 16:23:00 INFO - Cleaning up... 16:23:00 INFO - Return code: 0 16:23:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:23:00 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')]} 16:23:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:23:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:23:00 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')]} 16:23:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:23:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:23:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x1028d0a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10293d228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb850d4a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1028859f0>, '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 0x1025e4cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10284f990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/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.tp4DB8h2wj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 16:23:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 16:23:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --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 16:23:00 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/Render', 16:23:00 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:23:00 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:23:00 INFO - 'HOME': '/Users/cltbld', 16:23:00 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:23:00 INFO - 'LOGNAME': 'cltbld', 16:23:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:23:00 INFO - 'MOZ_NO_REMOTE': '1', 16:23:00 INFO - 'NO_EM_RESTART': '1', 16:23:00 INFO - 'PAGER': '/bin/cat', 16:23:00 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:23:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:23:00 INFO - 'PWD': '/builds/slave/test', 16:23:00 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:23:00 INFO - 'SHELL': '/bin/bash', 16:23:00 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.tp4DB8h2wj/Listeners', 16:23:00 INFO - 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', 16:23:00 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:23:00 INFO - 'USER': 'cltbld', 16:23:00 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:23:00 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:23:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:23:00 INFO - 'XPC_FLAGS': '0x0', 16:23:00 INFO - 'XPC_SERVICE_NAME': '0', 16:23:00 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:23:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:23:01 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-0yAxxh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:23:01 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-r6OxcX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:23:01 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-tMm8jG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:23:01 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-aKY0lt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:23:01 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-E0CCEt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:23:01 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-kKaxsl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:23:01 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-onOtgB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:23:01 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-D6DQej-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:23:01 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-IbaptW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:23:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:23:02 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-fliftb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:23:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:23:02 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-F5ld7y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:23:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:23:02 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-c8X4ov-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:23:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:23:02 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-GevMdR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:23:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:23:02 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-4WoWbg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:23:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:23:02 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-aNWydN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:23:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:23:02 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-UFZaln-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:23:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:23:02 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-qHmlcb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:23:03 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:23:03 INFO - Running setup.py install for manifestparser 16:23:03 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:23:03 INFO - Running setup.py install for mozcrash 16:23:03 INFO - Running setup.py install for mozdebug 16:23:03 INFO - Running setup.py install for mozdevice 16:23:03 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:23:03 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:23:03 INFO - Running setup.py install for mozfile 16:23:03 INFO - Running setup.py install for mozhttpd 16:23:03 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:23:04 INFO - Running setup.py install for mozinfo 16:23:04 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:23:04 INFO - Running setup.py install for mozInstall 16:23:04 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:23:04 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:23:04 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:23:04 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:23:04 INFO - Running setup.py install for mozleak 16:23:04 INFO - Running setup.py install for mozlog 16:23:04 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:23:04 INFO - Running setup.py install for moznetwork 16:23:04 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:23:04 INFO - Running setup.py install for mozprocess 16:23:04 INFO - Running setup.py install for mozprofile 16:23:05 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:23:05 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:23:05 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:23:05 INFO - Running setup.py install for mozrunner 16:23:05 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:23:05 INFO - Running setup.py install for mozscreenshot 16:23:05 INFO - Running setup.py install for moztest 16:23:05 INFO - Running setup.py install for mozversion 16:23:05 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:23:05 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:23:05 INFO - Cleaning up... 16:23:05 INFO - Return code: 0 16:23:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:23:05 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')]} 16:23:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:23:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:23:05 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')]} 16:23:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:23:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:23:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x1028d0a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10293d228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb850d4a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1028859f0>, '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 0x1025e4cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10284f990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/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.tp4DB8h2wj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 16:23:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 16:23:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 16:23:05 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/Render', 16:23:05 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:23:05 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:23:05 INFO - 'HOME': '/Users/cltbld', 16:23:05 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:23:05 INFO - 'LOGNAME': 'cltbld', 16:23:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:23:05 INFO - 'MOZ_NO_REMOTE': '1', 16:23:05 INFO - 'NO_EM_RESTART': '1', 16:23:05 INFO - 'PAGER': '/bin/cat', 16:23:05 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:23:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:23:05 INFO - 'PWD': '/builds/slave/test', 16:23:05 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:23:05 INFO - 'SHELL': '/bin/bash', 16:23:05 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.tp4DB8h2wj/Listeners', 16:23:05 INFO - 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', 16:23:05 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:23:05 INFO - 'USER': 'cltbld', 16:23:05 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:23:05 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:23:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:23:05 INFO - 'XPC_FLAGS': '0x0', 16:23:05 INFO - 'XPC_SERVICE_NAME': '0', 16:23:05 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:23:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:23:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:23:06 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-cn3rGb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:23:06 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)) 16:23:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:23:06 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-ufV4g4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:23:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 16:23:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:23:06 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-sVJWsb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:23:06 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)) 16:23:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:23:06 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-rSJ6g1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:23:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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)) 16:23:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:23:06 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-8M4S1o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:23:06 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)) 16:23:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:23:06 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-jknY8l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:23:06 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)) 16:23:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:23:06 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-r1CSNW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:23:06 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)) 16:23:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:23:06 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-N07DzO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:23:07 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)) 16:23:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:23:07 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-IyosiP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:23:07 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)) 16:23:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:23:07 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-JngMCV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:23:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 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)) 16:23:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:23:07 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-AJbP9b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:23:07 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)) 16:23:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:23:07 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-f39GUa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:23:07 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)) 16:23:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:23:07 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-3se8Xi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:23:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 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)) 16:23:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:23:07 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-PwkBQr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:23:07 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)) 16:23:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:23:07 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-H7vuLp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:23:07 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)) 16:23:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:23:07 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-gZQ66P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:23:08 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)) 16:23:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:23:08 INFO - Running setup.py (path:/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/pip-xCadiS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:23:08 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)) 16:23:08 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:23:08 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 16:23:08 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)) 16:23:08 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:23:08 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 16:23:08 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:23:08 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 16:23:08 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 16:23:08 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 16:23:08 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 16:23:08 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 16:23:08 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 16:23:10 INFO - Downloading blessings-1.5.1.tar.gz 16:23:10 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 16:23:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:23:10 INFO - Installing collected packages: blessings 16:23:10 INFO - Running setup.py install for blessings 16:23:10 INFO - Successfully installed blessings 16:23:10 INFO - Cleaning up... 16:23:10 INFO - Return code: 0 16:23:10 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:23:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:23:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:23:11 INFO - Reading from file tmpfile_stdout 16:23:11 INFO - Current package versions: 16:23:11 INFO - blessings == 1.5.1 16:23:11 INFO - blobuploader == 1.2.4 16:23:11 INFO - docopt == 0.6.1 16:23:11 INFO - manifestparser == 1.1 16:23:11 INFO - mozInstall == 1.12 16:23:11 INFO - mozcrash == 0.16 16:23:11 INFO - mozdebug == 0.1 16:23:11 INFO - mozdevice == 0.47 16:23:11 INFO - mozfile == 1.2 16:23:11 INFO - mozhttpd == 0.7 16:23:11 INFO - mozinfo == 0.9 16:23:11 INFO - mozleak == 0.1 16:23:11 INFO - mozlog == 3.0 16:23:11 INFO - moznetwork == 0.27 16:23:11 INFO - mozprocess == 0.22 16:23:11 INFO - mozprofile == 0.27 16:23:11 INFO - mozrunner == 6.11 16:23:11 INFO - mozscreenshot == 0.1 16:23:11 INFO - mozsystemmonitor == 0.0 16:23:11 INFO - moztest == 0.7 16:23:11 INFO - mozversion == 1.4 16:23:11 INFO - psutil == 3.1.1 16:23:11 INFO - requests == 1.2.3 16:23:11 INFO - wsgiref == 0.1.2 16:23:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:23:11 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')]} 16:23:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:23:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:23:11 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')]} 16:23:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:23:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:23:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x1028d0a30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10293d228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb850d4a8c0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1028859f0>, '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 0x1025e4cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10284f990>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'HOME': '/Users/cltbld', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/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.tp4DB8h2wj/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 16:23:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 16:23:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 16:23:11 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/Render', 16:23:11 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:23:11 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:23:11 INFO - 'HOME': '/Users/cltbld', 16:23:11 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:23:11 INFO - 'LOGNAME': 'cltbld', 16:23:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:23:11 INFO - 'MOZ_NO_REMOTE': '1', 16:23:11 INFO - 'NO_EM_RESTART': '1', 16:23:11 INFO - 'PAGER': '/bin/cat', 16:23:11 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:23:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:23:11 INFO - 'PWD': '/builds/slave/test', 16:23:11 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:23:11 INFO - 'SHELL': '/bin/bash', 16:23:11 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.tp4DB8h2wj/Listeners', 16:23:11 INFO - 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', 16:23:11 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:23:11 INFO - 'USER': 'cltbld', 16:23:11 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:23:11 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:23:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:23:11 INFO - 'XPC_FLAGS': '0x0', 16:23:11 INFO - 'XPC_SERVICE_NAME': '0', 16:23:11 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:23:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:23:11 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 1)) 16:23:11 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 2)) 16:23:11 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 3)) 16:23:11 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 4)) 16:23:11 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 5)) 16:23:11 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 6)) 16:23:11 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 7)) 16:23:11 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 8)) 16:23:11 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.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:23:11 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 3)) 16:23:11 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.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:23:11 INFO - Cleaning up... 16:23:11 INFO - Return code: 0 16:23:11 INFO - Running post-action listener: _resource_record_post_action 16:23:11 INFO - Running post-action listener: _start_resource_monitoring 16:23:11 INFO - Starting resource monitoring. 16:23:11 INFO - ##### 16:23:11 INFO - ##### Running install step. 16:23:11 INFO - ##### 16:23:11 INFO - Running pre-action listener: _resource_record_pre_action 16:23:11 INFO - Running main action method: install 16:23:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:23:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:23:11 INFO - Reading from file tmpfile_stdout 16:23:11 INFO - Detecting whether we're running mozinstall >=1.0... 16:23:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:23:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:23:11 INFO - Reading from file tmpfile_stdout 16:23:11 INFO - Output received: 16:23:11 INFO - Usage: mozinstall [options] installer 16:23:11 INFO - Options: 16:23:11 INFO - -h, --help show this help message and exit 16:23:11 INFO - -d DEST, --destination=DEST 16:23:11 INFO - Directory to install application into. [default: 16:23:11 INFO - "/builds/slave/test"] 16:23:11 INFO - --app=APP Application being installed. [default: firefox] 16:23:11 INFO - mkdir: /builds/slave/test/build/application 16:23:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 16:23:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 16:23:47 INFO - Reading from file tmpfile_stdout 16:23:47 INFO - Output received: 16:23:47 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 16:23:47 INFO - Running post-action listener: _resource_record_post_action 16:23:47 INFO - ##### 16:23:47 INFO - ##### Running run-tests step. 16:23:47 INFO - ##### 16:23:47 INFO - Running pre-action listener: _resource_record_pre_action 16:23:47 INFO - Running main action method: run_tests 16:23:47 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 16:23:47 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 16:23:47 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 16:23:47 INFO - 2015-11-05 16:23:47.051 screenresolution[1929:18062] starting screenresolution argv=screenresolution get 16:23:47 INFO - 2015-11-05 16:23:47.054 screenresolution[1929:18062] Display 0: 1600x1200x32@60 16:23:47 INFO - 2015-11-05 16:23:47.060 screenresolution[1930:18064] starting screenresolution argv=screenresolution list 16:23:47 INFO - Available Modes on Display 0 16:23:47 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 16:23:47 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 16:23:47 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 16:23:47 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 16:23:47 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 16:23:47 INFO - Intel HD Graphics 3000: 16:23:47 INFO - Chipset Model: Intel HD Graphics 3000 16:23:47 INFO - Type: GPU 16:23:47 INFO - Bus: Built-In 16:23:47 INFO - VRAM (Total): 512 MB 16:23:47 INFO - VRAM (Dynamic, Max): 10 16:23:47 INFO - Vendor: Intel (0x8086) 16:23:47 INFO - Device ID: 0x0116 16:23:47 INFO - Revision ID: 0x0009 16:23:47 INFO - Displays: 16:23:47 INFO - Display: 16:23:47 INFO - Resolution: 1600 x 1200 @ 60 Hz 16:23:47 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 16:23:47 INFO - Display Serial Number: 1600x1200 60 16:23:47 INFO - Main Display: Yes 16:23:47 INFO - Mirror: Off 16:23:47 INFO - Online: Yes 16:23:47 INFO - Rotation: Supported 16:23:47 INFO - Return code: 0 16:23:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:23:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:23:47 INFO - Python 2.7.3 16:23:47 INFO - Return code: 0 16:23:47 INFO - grabbing minidump binary from tooltool 16:23:47 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')]} 16:23:47 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 0x1028859f0>, '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 0x1025e4cd8>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10284f990>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:23:47 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 16:23:47 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 16:23:47 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:23:47 INFO - Return code: 0 16:23:47 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 16:23:47 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:23:47 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:23:47 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 16:23:47 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:23:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0004', '--webServer', 'localhost'] in /builds/slave/test/build 16:23:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0004 --webServer localhost 16:23:47 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.jXp44zOcdH/Render', 16:23:47 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 16:23:47 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 16:23:47 INFO - 'HOME': '/Users/cltbld', 16:23:47 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 16:23:47 INFO - 'LOGNAME': 'cltbld', 16:23:47 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:23:47 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 16:23:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:23:47 INFO - 'MOZ_NO_REMOTE': '1', 16:23:47 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:23:47 INFO - 'NO_EM_RESTART': '1', 16:23:47 INFO - 'PAGER': '/bin/cat', 16:23:47 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 16:23:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:23:47 INFO - 'PWD': '/builds/slave/test', 16:23:47 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:23:47 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 16:23:47 INFO - 'SHELL': '/bin/bash', 16:23:47 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.tp4DB8h2wj/Listeners', 16:23:47 INFO - 'TMPDIR': '/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/', 16:23:47 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 16:23:47 INFO - 'USER': 'cltbld', 16:23:47 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 16:23:47 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 16:23:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:23:47 INFO - 'XPC_FLAGS': '0x0', 16:23:47 INFO - 'XPC_SERVICE_NAME': '0', 16:23:47 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 16:23:47 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0004', '--webServer', 'localhost'] with output_timeout 3600 16:23:47 INFO - mozversion INFO | application_buildid: 20151105140536 16:23:47 INFO - mozversion INFO | application_changeset: 319e09c9668b8d2937c49dabdfd84a30d8771ac1 16:23:47 INFO - mozversion INFO | application_display_name: Nightly 16:23:47 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:23:47 INFO - mozversion INFO | application_name: Firefox 16:23:47 INFO - mozversion INFO | application_remotingname: firefox 16:23:47 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 16:23:47 INFO - mozversion INFO | application_vendor: Mozilla 16:23:47 INFO - mozversion INFO | application_version: 45.0a1 16:23:47 INFO - mozversion INFO | platform_buildid: 20151105140536 16:23:47 INFO - mozversion INFO | platform_changeset: 319e09c9668b8d2937c49dabdfd84a30d8771ac1 16:23:47 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 16:23:47 INFO - mozversion INFO | platform_version: 45.0a1 16:23:47 INFO - 2015-11-05 16:23:47,645 DEBUG : using testdate: 1446769427 16:23:47 INFO - 2015-11-05 16:23:47,645 DEBUG : actual date: 1446769427 16:23:47 INFO - 2015-11-05 16:23:47,655 INFO : starting webserver on 'localhost:56286' 16:23:47 INFO - 2015-11-05 16:23:47,656 INFO : Starting test suite t-yosemite-r5-0004 16:23:47 INFO - 2015-11-05 16:23:47,656 INFO : Starting test dromaeo_css 16:23:47 INFO - 2015-11-05 16:23:47,656 DEBUG : operating with platform_type : mac_ 16:23:47 INFO - 2015-11-05 16:23:47,657 INFO : Initialising browser for dromaeo_css test... 16:23:47 INFO - 2015-11-05 16:23:47,670 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/tmpKWnrg2/profile http://localhost:56286/getInfo.html 16:23:49 INFO - 2015-11-05 16:23:49,826 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:23:49 INFO - 2015-11-05 16:23:49,826 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:23:49 INFO - 2015-11-05 16:23:49,826 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:23:49 INFO - 2015-11-05 16:23:49,827 DEBUG : BROWSER_OUTPUT: __metrics 16:23:49 INFO - 2015-11-05 16:23:49,836 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:23:50 INFO - 2015-11-05 16:23:50,509 INFO : Browser initialized. 16:23:50 INFO - 2015-11-05 16:23:50,509 INFO : Running cycle 1/1 for dromaeo_css test... 16:23:50 INFO - 2015-11-05 16:23:50,509 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/tmpKWnrg2/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:24:02 INFO - 2015-11-05 16:24:02,329 DEBUG : BROWSER_OUTPUT: RSS: Main: 223002624 16:24:02 INFO - 2015-11-05 16:24:02,330 DEBUG : BROWSER_OUTPUT: 16:24:54 INFO - 2015-11-05 16:24:54,095 DEBUG : BROWSER_OUTPUT: 1446769494090 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] 16:27:03 INFO - 2015-11-05 16:27:03,842 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/dromaeo/cssquery-dojo.html (next: http://localhost:56286/tests/dromaeo/cssquery-ext.html) 16:27:05 INFO - 2015-11-05 16:27:05,167 DEBUG : BROWSER_OUTPUT: RSS: Main: 318169088 16:27:05 INFO - 2015-11-05 16:27:05,167 DEBUG : BROWSER_OUTPUT: 16:30:07 INFO - 2015-11-05 16:30:07,605 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/dromaeo/cssquery-ext.html (next: http://localhost:56286/tests/dromaeo/cssquery-jquery.html) 16:30:08 INFO - 2015-11-05 16:30:08,189 DEBUG : BROWSER_OUTPUT: RSS: Main: 363855872 16:30:08 INFO - 2015-11-05 16:30:08,189 DEBUG : BROWSER_OUTPUT: 16:33:10 INFO - 2015-11-05 16:33:10,303 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/dromaeo/cssquery-jquery.html (next: http://localhost:56286/tests/dromaeo/cssquery-mootools.html) 16:33:10 INFO - 2015-11-05 16:33:10,888 DEBUG : BROWSER_OUTPUT: RSS: Main: 333107200 16:33:10 INFO - 2015-11-05 16:33:10,889 DEBUG : BROWSER_OUTPUT: 16:36:12 INFO - 2015-11-05 16:36:12,853 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/dromaeo/cssquery-mootools.html (next: http://localhost:56286/tests/dromaeo/cssquery-prototype.html) 16:36:13 INFO - 2015-11-05 16:36:13,421 DEBUG : BROWSER_OUTPUT: RSS: Main: 314482688 16:36:13 INFO - 2015-11-05 16:36:13,421 DEBUG : BROWSER_OUTPUT: 16:39:16 INFO - 2015-11-05 16:39:16,406 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/dromaeo/cssquery-prototype.html (next: http://localhost:56286/tests/dromaeo/cssquery-yui.html) 16:39:17 INFO - 2015-11-05 16:39:17,001 DEBUG : BROWSER_OUTPUT: RSS: Main: 312463360 16:39:17 INFO - 2015-11-05 16:39:17,001 DEBUG : BROWSER_OUTPUT: 16:42:19 INFO - 2015-11-05 16:42:19,558 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/dromaeo/cssquery-yui.html (next: http://localhost:56286/tests/dromaeo/cssquery-dojo.html) 16:42:19 INFO - 2015-11-05 16:42:19,817 DEBUG : BROWSER_OUTPUT: RSS: Main: 358957056 16:42:19 INFO - 2015-11-05 16:42:19,817 DEBUG : BROWSER_OUTPUT: 16:42:19 INFO - 2015-11-05 16:42:19,818 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:42:19 INFO - 2015-11-05 16:42:19,818 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:42:19 INFO - 2015-11-05 16:42:19,818 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:42:19 INFO - 2015-11-05 16:42:19,818 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:42:19 INFO - 2015-11-05 16:42:19,818 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3154.5899033125697;3216.4371235033877;3233.466478031125;3264.069740124065;3267.1342094345005;5201.791928322872;5286.524212820846;5367.543758780504;5398.6490878092945;5435.646682965605;5270.262163297141;5273.841784746463;5324.600654950875;5328.813491527797;5427.728613569326;4921.237208232729;4926.211806111023;4937.5556199942;4975.129352363322;5064.822731204408;4999.650024498268;5135.050015747099;5135.589152867761;5156.3296771419855;5159.5794868229705;4852.975735121302;4857.514248575149;4951.183054795954;4980.402351717817;5034.496550344955;5018.473060328686;5020.322256495363;5034.672746271517;5070.138076527;5103.4896510349035;4981.950180498221;4999.875003124915;5012.924806127911;5023.070731914608;5029.119904016819;5154.4587818278915;5311.389190243094;5312.4687531246955;5319.760610772486;5408.91886621701;5709;5717.628354157008;5719.71401429931;5731.111677689923;5733.827985160452;5787.913181302241;5791.21818554494;5798.797042103506;5811.82564523065;5818;5210.348706411699;5339.759710813023;5353.2773075634295;5355.6786592804165;5363.919541206885;5872.559558033165;5883.794067207627;5915.645061296336;5915.881682366328;5922.8815423691285;5537.529310008614;5636.887262254732;5643.209950606918;5648.604597678205;5687.203791469197;5804.767809287581;5821.621594596422;5829.358770535237;5832.300123985064;5857.062869940874;5730.856728581735;5733.082706766897;5737.139429085587;5742.684152371659;5743.310802703702;5484.890302194013;5603.831885043455;5613.719314034363;5621.325440947031;5734.053881109654;4488.618467430305;4496.977515112403;4501.122281155143;4513.119941611354;4561.133384656904;4081.3265811141423;4105.035316700573;4105.89735256615;4138.193052354762;4148.23257697327;5325.121354976385;5354.196870469461;5428.4028756836715;5439.972800135974;5456.290682211366;5794.159846822187;5800.303963524319;5802.593818432669;5819.185314056035;5822.010258256022;5426.538744206708;5429.701366424884;5443.482869127427;5453.563714902798;5457.727113644302;4894.853154405374;4932.704037757746;4997.675151115166;5004.149294619923;5060.696358218445;5790.218320526675;5803.100519419497;5810.970945145332;5830.825075247664;5831.271091113611;5730.1977723119635;5736.713164341682;5747.74135163927;5754.251947246831;5771.451712087345;5734.741936612946;5838.591298609056;5839.5036421904615;5846.912296315473;5964.373740757158;5777.7977770777825;5781.132830075522;5781.190633311424;5802.100674395476;5811.389804070681;5848.356680765028;5849.824505264849;5851.590388672752;5853.9121913172185;5856.882862342644;5415.160650099241;5535.8892822144135;5537.224788529689;5581.246531718329;5700.657960522216;5626.381098079126;5636.408177141341;5680.602357835077;5690.345610254708;5695.943040569541;5474.616776825744;5544.833654990357;5559.52744016747;5565.638233514808;5566.415526369835;5521.3926468087675;5589.608727389043;5652.915206271827;5672.12082127271;5797.826065218051;5533.280673512418;5545.833624991256;5547.528460080938;5554.055810512142;5560.638558493847 16:42:19 INFO - 2015-11-05 16:42:19,818 DEBUG : BROWSER_OUTPUT: |1;ext.html;552.3951273355675;558.210132662283;564.0495764636588;578.878435528539;599.5413508665869;31826.522602160956;32465.837670811612;32478.67521324786;39835.203295934065;40850.36598536055;43265;43750.78124609381;43766.34350484745;43770.781146094305;43814.34278485825;9421.952890235556;9577.95211023944;9604.855927161097;9619.086186812277;9623.133917947383;8578.571071446433;8736.257418119467;9312.906870931305;11046.668599941975;11302.208845380826;10922.235443518957;10995.450227488594;11018.338899666045;11038.668839934775;11097.11223102154;8376.204260595294;10848.620298289561;10973.670789876316;10997.395143267117;11016.449177541172;8186.590670466453;11155.609553665663;11457.828132578017;11470.770584588261;11476.426178691032;40630;41066.79466602678;41069;41102.79448602738;41113;3084.0593618946214;3114;3157.5737275467745;3464;3483.390406678821;27992.720072799217;28094;28102;28160.577591336147;28231.294217644518;2209.520389434212;2217.789310015546;2222.9555408891893;2242.7196600424945;2245.057076028072;300605;300635;303201;303670;304542.47728761437;56234;57495.71252143796;59422;59832;64259.67870160619;61035.38964610297;61575.38424615786;61788.69105654443;61804;61814;16897.15514224284;17084.231209595597;17095.145242737814;17119.22963466647;17119.57201069983;13039.543615973396;13109.213447193199;13109.737805243842;13118;13137.408816603276;19210.80789192118;19256.711149332772;19572.510687232934;19607.705884411746;19659.901700491693;8357.498550087013;8669.738007343312;8672.739817805475;8676.826463470696;8748.65005399777;945.281585994649;1033.0495943731785;1066.2429674930886;1100.8458815765798;1151.2401814802358;29079.7092029077;29456.606333938624;29475.852620736758;29562.40875182484;29607;1126.8929451702074;1166.3643314393505;1206.9336186509652;1215.7629262293945;1269.7968325067945;15186.316615752317;15358.462453814287;15385.307661155275;15512.224388780516;15630.609234769221;318316;322000;323858;323874;324407;55241.44758552443;55557;55662.721686391305;55688.44311556833;55705.72147139238;1387.1884947305737;1402.9649258768613;1419.822522184727;1420.0911416693325;1420.5454254638623;28708;28834.990775322764;28891.56662650104;29296.41407171802;29427.264318392212;49071;49498.75250623724;49550;49571.25643115284;49680;288098;289778;290270;290672;290877;27497.45005099847;27907.302317442227;31842;32401;33071.50392744159;38016.239675206896;38131.237375252895;38309.4253586202;38450;38692.80653596714;32410;33104.83447582747;33182.502262466565;33222;35917.461238081974;32931;34567.308653827284;34902;35655.93032209038;35775.46336805002;30912;31341.529877051405;35774.642253577134;36313.45529817002;36996.07509812276;28961.275968100967;31636.683633163375;31695.08726147451;31709.207269817518;31776.364472709953;24246;24268.150614728398;24339.63490547608;24529.264122076365;24583.754162458146 16:42:19 INFO - 2015-11-05 16:42:19,819 DEBUG : BROWSER_OUTPUT: |2;jquery.html;339.33490358896563;341.48265377952407;344.4729563767435;344.6054267863295;350.78251484079874;14675.119492830438;14972.026818256832;17501.29994800208;17621.237876212374;18231.908840455795;14363.856361436383;15709.84290157098;17539.91230043851;17885.552861178443;17963;5292.179712144604;5406.648567843097;5421.756020979045;5428.050091234038;5441.5102640762325;3924.2936271471126;4046.210988857174;5097.617678674096;5297.814576489824;5318.973405132969;5625.943740562603;5799.565032622549;5812.767489300444;5821.243238379005;5840.06558950568;5339.893202135955;5801.854953626172;5948;5954.55340849438;5958.493528050121;5116.488351164891;5120.231965205212;5125.974370128163;5127.128388174019;5138.58891288696;21433.14267429301;21562.568748625097;21730.348089557338;21763.129474820988;21895.233666821743;1979.3666026871406;2041.3671761753903;2099.359695292935;2106.147010460766;2132.7867213278546;13448.731025379439;13533.458661653522;13624.523141689993;13967.720645587133;14060.08609440383;1632.8612067974236;1688.4681325382464;1737.539552018716;1783.8929664220188;1787.9106044697712;58395.41604583985;59818.99999999956;60367.69816150891;61201.693991529755;61516.69241653808;9457;9629.662961796445;9823.656172033945;9855.408675479493;9911.65309214174;12008.279503229835;12017.699557511132;12027.819582706266;12038.939805301092;12043.337616431181;5471.261379713767;5522.116461366162;5528.198411230349;5600.803971860965;7861.213878612093;5827.6013756698085;6027.126066720301;6085.300190478063;6138.78514252008;6143.56995010345;2980.7466365359187;3000.369922316338;3008.6389633244153;3023.712747289004;3028.6214223222096;1006.8942761010135;1049.459528342904;1058.9682309530726;1090.340344091829;1107.8227483602584;458.44070234314086;472.4448772692073;473.0987468871805;479.86803629002304;480.7404001838968;11477.311361318347;12059.879401206052;12066.818997715041;12067.637970860887;12131.090168237417;451.8463722334422;456.13334664138404;457.6796242630172;464.27109438182407;496.75162418790603;6125.1731016313115;6210.689465526796;6223.066540019034;6261.060840873814;6275.717592708248;526493;533896;535230;539682;560786;71015;72956.27043729495;74221.6288918552;74348.25651743522;75449.24550754532;496.29773869974304;508.2452557951439;508.98982020359387;509.04299916157385;509.2234342627523;11100.167487438313;11129.82150286292;11172.888271117185;11218.66344009681;11237.550497980315;34897.12757181091;35000.82499587486;35677.82161089178;35812.28375432529;35889;47801.760991194824;48032;48052.27921581249;48629;48689.51310486991;6048.969755151196;6155.815325540241;6234.625922444668;6245.937540624717;6322.778702745381;11387.089032877184;11786.292822430682;11822.586209482626;11842.585509507126;11844.76310473803;8497.320214382711;8788.296936244957;9083;9453.763655908657;10150.796984060426;9812.116909478182;9830.901690982999;9945.900540994497;10117.08946194846;10218.489075546044;10087;10344.172466202535;10440.947795260976;10481.161507079567;10482.266241363031;6165.383461653799;6346.111544383698;6353.5870168438905;6354.046892966092;6360.141380913703;9792.314537982273;10143.137833284254;10286.2799604027;10310.32982856112;10351.327163734635 16:42:19 INFO - 2015-11-05 16:42:19,819 DEBUG : BROWSER_OUTPUT: |3;mootools.html;914.7347269291905;1452.8329242137152;1456.1190479759746;1757.2707326459517;1828.9392152551522;7044.5421047631935;7330.853382932338;7459.738909138167;7477.065366829146;7479.027726395568;7149.785506434815;7338.449616278787;7338.853222935538;7364.189939106707;7376.373008294288;1916.3197065041918;1947.7467929169188;2183.355910006544;2185.5519618478215;2213.712217411742;2229.6209644360497;2233.36349140495;2234.229190929127;2236.452069243038;2240.406292332533;2169.652855543113;2211.94470138247;2214.4906671465574;2217.2350539063996;2219.012539419951;1932.3043704266454;1966.9016549172484;2208.6466165413617;2232.0625337358347;2232.966505502419;2220.4448887778058;2236.37381533171;2259.1641092795608;2260.2654137405407;2269.4099534121083;7596.468247222697;7627.046619172604;7644.541327520366;7647.158812530617;7666.808329791744;4746.288056791474;4826.493218212107;4829.227323628238;4831.9275210871865;4841;2766.847823369734;2827.8586070696383;2868.4119755450083;2912.577676236955;2914.3734097169;879.3888247667874;896.3501461440469;902.6795487601872;905.3210092430677;1486.873615742663;9983.950080249624;10041.799164016751;10054.748631284203;10065.345752526062;10066.899331006669;4177.206330797138;4230.323148296319;4248.702590818675;4253.766042867672;4295.484541854998;8341.791455213546;8347.373946954003;8355.916440835514;8359.456635318686;8362.58187090643;4788.928166077511;4791;4792.281157826354;4794.640401969867;4809;4449.488308844459;4450.488193857683;4452.532484089124;4457.264551349056;4459.620932220798;3293.5224392463438;3388.8305584721156;3407.3185362927516;3426.777259478126;3430.5711786026745;1040.245821779204;1043.7338478688039;1050.5325130317087;1054.3463052907246;1055.5091882274778;1330.5609148980814;1332.6801567623895;1336.6524703576945;1368.856270091646;1370.205280937054;7364.668589913466;7379.963100184465;7521.097468303729;7534.397248220129;7536.962315188499;1072.8498010278568;1117.1788735279563;1173.1084375874398;1175.0893057880212;1195;5883.264591926009;5904.822855314347;5906.468417842415;5921.822345329647;5923.496502797224;8777.473351598925;9109;9121.45271283725;9132.406393584395;9136.406133601295;9015.323850711224;9049.954750226207;9056.275497960147;9069.229115525122;9092.636294548276;7100.68046937889;7133.179684336264;7264.709411623476;7272.090988626422;7291.234420385889;7022.613756243456;7056.6118863463;7059.5764254144915;7065;7070.045543851515;7954.681812727426;8168;8195.754127376189;8197.508149511048;8202.425830191829;7885.408594355561;8025.9197408025175;8040.638171282189;8042.919570804217;8050.597470126588;6771.39057484809;6923.169219693669;6942.8611427772175;6951.096357473698;6957.060796792368;7453.515521491086;7481.625918704151;7487.251274872469;7502.587357695379;7508.887366689395;5950.494207992369;6838.350356716104;6955.930440695528;7081.362677359062;7084.645767711697;6631.071649969104;6708.865822683421;6759.459243260626;6819.0794242778575;6936.479764017819;6606.537542371988;6680.866382672417;6711.765088221889;6722.831929201809;6737.764178253934;6346.841328966812;6409.4231519163495;6415.935840641534;6418.037294405876;6419.935800641933;6470.38531339522;6527.445167160655;6533.640649764308;6539.215294164731;6564.8358791030605 16:42:19 INFO - 2015-11-05 16:42:19,819 DEBUG : BROWSER_OUTPUT: |4;prototype.html;313.3591804759268;322.60158704000554;325.06867823685144;328.9194147433879;329.60118256909124;6009.759609615621;6040.244969378828;6115.296740874801;6116.296625888024;6142.8464288392815;5856.795012174574;5987.4910632596175;6009.128676341938;6027.819165425033;6080.179175811264;4548.9090218195615;4636.721796692209;4642.930356044662;4659.930101048487;4676.508966558505;4585.908281834361;4637.9536204638025;4657.673962822604;4659.277811939155;4665.673402861801;4589.2886602576655;4605.4933957264675;4611.239145540982;4613.1926912790295;4622.514635963226;4607.055553611518;4611.193041217807;4618.49196588375;4627.1439783640135;4638.605718513931;3856.0745421098736;3994.121293315466;4005.8998525036814;4011.7392369496183;4058.391241313797;5825.330087040003;5845.795397161121;5862.472377486004;5869.325027621793;5871.55963302754;5152.896942061137;5156.74216289184;5159.664621799571;5162.070827251093;5180.896382072375;6084.330723620398;6189.783357582508;6207.224096987877;6277.183966084425;6287.245530536319;4211.178820130076;4256.765877876715;4256.829726810924;4261.914761704779;4268.807903644312;6506.772262970773;6626.304238055031;6628.138342015507;6628.635425051621;6639.236487803916;4214.072903961123;4299.129878502861;4342.0664557119735;4345.67407444443;4346.847860324873;4411.205982923105;4422.20400327944;4424.225760491901;4425.026494171278;4430.446194225722;5112.36095488064;5127.4872512748425;5135.666181698178;5137.640365174402;5146;6282.654454004982;6286.779962701375;6290.245170579468;6299.338569450233;6323.494120470444;1542.7591276647881;1573.2841557091497;1579.676166385911;1593.1556275174175;1599.2643384043238;1023.0485648347109;1034.0693375961544;1038.065740833256;1044.6291566493937;1045.628801775374;6179.783707570214;6194.318624951252;6195.504359651217;6196.783112591038;6206.844828879314;6618.271990081087;6626.138601981712;6627.569208001464;6636.13730215069;6652.966735166293;6143.539234557336;6170.907436388457;6184.350643182401;6208.81373558794;6210.285817131088;3588.8923332300074;3662.1943172502006;3668.834902429344;3677.5035370225214;3681.944770828386;6709.261981182066;6724;6749.763758268437;6762.864742705118;6767.526273160832;6783.932160678429;6794;6795.286494918061;6795.898061529081;6822.488313376417;6529.281779004401;6620.238672552622;6737.191537015589;6756.2568117507035;6758.05387245786;6507.479401647952;6527.412532872065;6580.7038683260325;6598.076269322395;6639.170103737033;6447;6473.676316184266;6479;6480.384363485461;6491.091247225298;6561.1470508833545;6715.865682686416;6722.596644201363;6747.932520674731;6752.3922846944015;4322.459692538433;4344;4348.804303806273;4350.9564904350555;4355.760433176079;6675.399214070757;6676.031975363448;6688.498362622726;6691.732330706912;6693.163354580677;6299.149614802126;6434.260060093149;6446.709898054505;6466.612003279818;6488.480921526361;6473.2232132144445;6497.5126865484335;6507.056476810931;6518.869622607616;6520.836979075561;6324.2410910691015;6342.49260059185;6347.079673447232;6348.587341822767;6356.68216589178;6330.303666596578;6484.837879053061;6500.772472963424;6509.349065093642;6524.184476940382;6262.09199666055;6279.560430769985;6279.811605651837;6283.5287353449585;6293.527985401205 16:42:19 INFO - 2015-11-05 16:42:19,820 DEBUG : BROWSER_OUTPUT: |5;yui.html;706.6043015911087;729.6133049483775;748.4910261022504;769.3921801776595;792.342355844649;13463.663408414795;14040.929795351021;14048.929755351222;14054.437822487114;14080.436782528712;13407.798883016763;13484.325783710825;13490.527831525898;13509.662258443544;13519.864801351983;720.5928650312583;728.4645785347765;909.6497848328409;913.7213149989267;933.5985526223722;899.9550022498881;902.9187373136416;911.5670056723037;911.7857303533664;912.0241341764315;980.8332583460829;985.9359141655806;986.3292960786662;986.8914419413894;987.6839411388358;748.4424104042496;758.1773775453639;928.8699582058483;946.2619157057507;946.356477595235;704.7357241034612;705.1960764728213;705.5766540075965;705.6471764117941;706.6784613001072;13819.170849749047;13994.720105597933;14006.649833754136;14013.859861401357;14045.08706934046;11770.529178832836;11778.528858845635;12092.455839487244;12106.697332566668;12107.576234831738;9450.149486546175;9489.335746497747;9495.335326527145;9521.095495927875;9552.95223523878;3265.706086452207;3313.8343082845763;3314.5691060162026;3378.946639358031;3440.673136052071;48645.270320945216;48890;49407;50354.468097871;50595.98808023856;9029.593668284942;9071.501067441353;9152.95423522878;9201.30990175726;9658.661946831828;12466.626001219978;12591.685207869694;12613.936930315289;12629.621111366674;19553;6310.242770867525;6320.115183874262;6343.9682801585695;6409.198850143732;6433.581817181868;3685.2997930393676;3756.380197267475;3762.6425489578446;3774.5281839770028;3850.942235866464;2672.078133044097;2714.24001279642;2722.6324446199906;2722.945541089207;2723.237493501823;411.4005419411014;411.63570240337515;420.62144070336944;420.70550614569925;421.7933212725804;572.6764378126428;583.9240898683144;598.8862116197909;611.5657882903099;620.1163342237294;7487.962560187273;8221.54781487024;8439.620217090245;8573.356998225157;8704.608292626846;491.5944345914635;503.7984806077598;542.6581253810075;587.2747157260779;611.1291409741101;3817.522809648794;3872.225554888977;4144.979275103666;4192.685548583869;4290.957090429119;60896;61816.38183618106;61927.07109393363;61945.690271549254;62135.6893215531;51790;52006.73996630068;52107;52112.47887521076;52919.735401323516;48020.519794802305;48040.519594803605;48230.27654585184;48283.5171648279;48865;8019.639116239667;8085.353171746364;8179.182081792012;8314.958425207835;8457.957710211409;35495.82252088723;35837.64162358343;35902;36112;36593;44062;44095.55904440914;44595.331070033324;45325.32012019756;45432.09135817199;7644.885326719992;7804.258595433652;7819.1398946117015;7900.68397264126;8041.638126284214;11162.776744465227;11330.150238731963;11341.206115571831;11483.712907177052;11488.19066740595;10614.1508679307;10992.065674417445;10993.065589424668;11512.654620361403;11571.363575003455;10486.674680646154;10804.945975270073;10913.23607347478;11151.55393784272;11231.71920701989;7482.812929676802;9862;10324.741881453023;10435.94782026085;11018.889811102106;7907.446478746432;8024.919750802417;8302.335813134814;8366.456180348257;8567.657293708182;8101.675932962616;8865.867011994696;8960.32797540174;9132.497712625604;9133.315001375056 16:42:19 INFO - 2015-11-05 16:42:19,821 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:42:19 INFO - 2015-11-05 16:42:19,821 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:42:19 INFO - 2015-11-05 16:42:19,821 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1024 16:42:19 INFO - 2015-11-05 16:42:19,821 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:42:19 INFO - 2015-11-05 16:42:19,821 DEBUG : BROWSER_OUTPUT: __startTimestamp1446770539808__endTimestamp 16:42:19 INFO - 2015-11-05 16:42:19,821 DEBUG : BROWSER_OUTPUT: 16:42:19 INFO - 2015-11-05 16:42:19,821 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:42:19 INFO - 2015-11-05 16:42:19,822 DEBUG : BROWSER_OUTPUT: Number of tests: 6 16:42:19 INFO - 2015-11-05 16:42:19,822 DEBUG : BROWSER_OUTPUT: 16:42:19 INFO - 2015-11-05 16:42:19,822 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5366.36 Median:5537.53 stddev:560.04 (10.1%) stddev-sans-first:534.21 16:42:19 INFO - 2015-11-05 16:42:19,823 DEBUG : BROWSER_OUTPUT: Values: 3154.6 3216.4 3233.5 3264.1 3267.1 5201.8 5286.5 5367.5 5398.6 5435.6 5270.3 5273.8 5324.6 5328.8 5427.7 4921.2 4926.2 4937.6 4975.1 5064.8 4999.7 5135.1 5135.6 5156.3 5159.6 4853.0 4857.5 4951.2 4980.4 5034.5 5018.5 5020.3 5034.7 5070.1 5103.5 4982.0 4999.9 5012.9 5023.1 5029.1 5154.5 5311.4 5312.5 5319.8 5408.9 5709.0 5717.6 5719.7 5731.1 5733.8 5787.9 5791.2 5798.8 5811.8 5818.0 5210.3 5339.8 5353.3 5355.7 5363.9 5872.6 5883.8 5915.6 5915.9 5922.9 5537.5 5636.9 5643.2 5648.6 5687.2 5804.8 5821.6 5829.4 5832.3 5857.1 5730.9 5733.1 5737.1 5742.7 5743.3 5484.9 5603.8 5613.7 5621.3 5734.1 4488.6 4497.0 4501.1 4513.1 4561.1 4081.3 4105.0 4105.9 4138.2 4148.2 5325.1 5354.2 5428.4 5440.0 5456.3 5794.2 5800.3 5802.6 5819.2 5822.0 5426.5 5429.7 5443.5 5453.6 5457.7 4894.9 4932.7 4997.7 5004.1 5060.7 5790.2 5803.1 5811.0 5830.8 5831.3 5730.2 5736.7 5747.7 5754.3 5771.5 5734.7 5838.6 5839.5 5846.9 5964.4 5777.8 5781.1 5781.2 5802.1 5811.4 5848.4 5849.8 5851.6 5853.9 5856.9 5415.2 5535.9 5537.2 5581.2 5700.7 5626.4 5636.4 5680.6 5690.3 5695.9 5474.6 5544.8 5559.5 5565.6 5566.4 5521.4 5589.6 5652.9 5672.1 5797.8 5533.3 5545.8 5547.5 5554.1 5560.6 16:42:19 INFO - 2015-11-05 16:42:19,823 DEBUG : BROWSER_OUTPUT: 16:42:19 INFO - 2015-11-05 16:42:19,824 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:47493.91 Median:17249.55 stddev:79775.37 (462.5%) stddev-sans-first:79921.30 16:42:19 INFO - 2015-11-05 16:42:19,825 DEBUG : BROWSER_OUTPUT: Values: 552.4 558.2 564.0 578.9 599.5 31826.5 32465.8 32478.7 39835.2 40850.4 43265.0 43750.8 43766.3 43770.8 43814.3 9422.0 9578.0 9604.9 9619.1 9623.1 8578.6 8736.3 9312.9 11046.7 11302.2 10922.2 10995.5 11018.3 11038.7 11097.1 8376.2 10848.6 10973.7 10997.4 11016.4 8186.6 11155.6 11457.8 11470.8 11476.4 40630.0 41066.8 41069.0 41102.8 41113.0 3084.1 3114.0 3157.6 3464.0 3483.4 27992.7 28094.0 28102.0 28160.6 28231.3 2209.5 2217.8 2223.0 2242.7 2245.1 300605.0 300635.0 303201.0 303670.0 304542.5 56234.0 57495.7 59422.0 59832.0 64259.7 61035.4 61575.4 61788.7 61804.0 61814.0 16897.2 17084.2 17095.1 17119.2 17119.6 13039.5 13109.2 13109.7 13118.0 13137.4 19210.8 19256.7 19572.5 19607.7 19659.9 8357.5 8669.7 8672.7 8676.8 8748.7 945.3 1033.0 1066.2 1100.8 1151.2 29079.7 29456.6 29475.9 29562.4 29607.0 1126.9 1166.4 1206.9 1215.8 1269.8 15186.3 15358.5 15385.3 15512.2 15630.6 318316.0 322000.0 323858.0 323874.0 324407.0 55241.4 55557.0 55662.7 55688.4 55705.7 1387.2 1403.0 1419.8 1420.1 1420.5 28708.0 28835.0 28891.6 29296.4 29427.3 49071.0 49498.8 49550.0 49571.3 49680.0 288098.0 289778.0 290270.0 290672.0 290877.0 27497.5 27907.3 31842.0 32401.0 33071.5 38016.2 38131.2 38309.4 38450.0 38692.8 32410.0 33104.8 33182.5 33222.0 35917.5 32931.0 34567.3 34902.0 35655.9 35775.5 30912.0 31341.5 35774.6 36313.5 36996.1 28961.3 31636.7 31695.1 31709.2 31776.4 24246.0 24268.2 24339.6 24529.3 24583.8 16:42:19 INFO - 2015-11-05 16:42:19,825 DEBUG : BROWSER_OUTPUT: 16:42:19 INFO - 2015-11-05 16:42:19,825 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:27475.01 Median:24137.43 stddev:88273.63 (365.7%) stddev-sans-first:88497.74 16:42:19 INFO - 2015-11-05 16:42:19,826 DEBUG : BROWSER_OUTPUT: Values: 339.3 341.5 344.5 344.6 350.8 14675.1 14972.0 17501.3 17621.2 18231.9 14363.9 15709.8 17539.9 17885.6 17963.0 5292.2 5406.6 5421.8 5428.1 5441.5 3924.3 4046.2 5097.6 5297.8 5319.0 5625.9 5799.6 5812.8 5821.2 5840.1 5339.9 5801.9 5948.0 5954.6 5958.5 5116.5 5120.2 5126.0 5127.1 5138.6 21433.1 21562.6 21730.3 21763.1 21895.2 1979.4 2041.4 2099.4 2106.1 2132.8 13448.7 13533.5 13624.5 13967.7 14060.1 1632.9 1688.5 1737.5 1783.9 1787.9 58395.4 59819.0 60367.7 61201.7 61516.7 9457.0 9629.7 9823.7 9855.4 9911.7 12008.3 12017.7 12027.8 12038.9 12043.3 5471.3 5522.1 5528.2 5600.8 7861.2 5827.6 6027.1 6085.3 6138.8 6143.6 2980.7 3000.4 3008.6 3023.7 3028.6 1006.9 1049.5 1059.0 1090.3 1107.8 458.4 472.4 473.1 479.9 480.7 11477.3 12059.9 12066.8 12067.6 12131.1 451.8 456.1 457.7 464.3 496.8 6125.2 6210.7 6223.1 6261.1 6275.7 526493.0 533896.0 535230.0 539682.0 560786.0 71015.0 72956.3 74221.6 74348.3 75449.2 496.3 508.2 509.0 509.0 509.2 11100.2 11129.8 11172.9 11218.7 11237.6 34897.1 35000.8 35677.8 35812.3 35889.0 47801.8 48032.0 48052.3 48629.0 48689.5 6049.0 6155.8 6234.6 6245.9 6322.8 11387.1 11786.3 11822.6 11842.6 11844.8 8497.3 8788.3 9083.0 9453.8 10150.8 9812.1 9830.9 9945.9 10117.1 10218.5 10087.0 10344.2 10440.9 10481.2 10482.3 6165.4 6346.1 6353.6 6354.0 6360.1 9792.3 10143.1 10286.3 10310.3 10351.3 16:42:19 INFO - 2015-11-05 16:42:19,827 DEBUG : BROWSER_OUTPUT: 16:42:19 INFO - 2015-11-05 16:42:19,827 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5324.11 Median:6498.92 stddev:2707.45 (41.7%) stddev-sans-first:2694.75 16:42:19 INFO - 2015-11-05 16:42:19,828 DEBUG : BROWSER_OUTPUT: Values: 914.7 1452.8 1456.1 1757.3 1828.9 7044.5 7330.9 7459.7 7477.1 7479.0 7149.8 7338.4 7338.9 7364.2 7376.4 1916.3 1947.7 2183.4 2185.6 2213.7 2229.6 2233.4 2234.2 2236.5 2240.4 2169.7 2211.9 2214.5 2217.2 2219.0 1932.3 1966.9 2208.6 2232.1 2233.0 2220.4 2236.4 2259.2 2260.3 2269.4 7596.5 7627.0 7644.5 7647.2 7666.8 4746.3 4826.5 4829.2 4831.9 4841.0 2766.8 2827.9 2868.4 2912.6 2914.4 879.4 896.4 902.7 905.3 1486.9 9984.0 10041.8 10054.7 10065.3 10066.9 4177.2 4230.3 4248.7 4253.8 4295.5 8341.8 8347.4 8355.9 8359.5 8362.6 4788.9 4791.0 4792.3 4794.6 4809.0 4449.5 4450.5 4452.5 4457.3 4459.6 3293.5 3388.8 3407.3 3426.8 3430.6 1040.2 1043.7 1050.5 1054.3 1055.5 1330.6 1332.7 1336.7 1368.9 1370.2 7364.7 7380.0 7521.1 7534.4 7537.0 1072.8 1117.2 1173.1 1175.1 1195.0 5883.3 5904.8 5906.5 5921.8 5923.5 8777.5 9109.0 9121.5 9132.4 9136.4 9015.3 9050.0 9056.3 9069.2 9092.6 7100.7 7133.2 7264.7 7272.1 7291.2 7022.6 7056.6 7059.6 7065.0 7070.0 7954.7 8168.0 8195.8 8197.5 8202.4 7885.4 8025.9 8040.6 8042.9 8050.6 6771.4 6923.2 6942.9 6951.1 6957.1 7453.5 7481.6 7487.3 7502.6 7508.9 5950.5 6838.4 6955.9 7081.4 7084.6 6631.1 6708.9 6759.5 6819.1 6936.5 6606.5 6680.9 6711.8 6722.8 6737.8 6346.8 6409.4 6415.9 6418.0 6419.9 6470.4 6527.4 6533.6 6539.2 6564.8 16:42:19 INFO - 2015-11-05 16:42:19,829 DEBUG : BROWSER_OUTPUT: 16:42:19 INFO - 2015-11-05 16:42:19,829 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5317.60 Median:6143.19 stddev:1624.02 (26.4%) stddev-sans-first:1584.55 16:42:19 INFO - 2015-11-05 16:42:19,829 DEBUG : BROWSER_OUTPUT: Values: 313.4 322.6 325.1 328.9 329.6 6009.8 6040.2 6115.3 6116.3 6142.8 5856.8 5987.5 6009.1 6027.8 6080.2 4548.9 4636.7 4642.9 4659.9 4676.5 4585.9 4638.0 4657.7 4659.3 4665.7 4589.3 4605.5 4611.2 4613.2 4622.5 4607.1 4611.2 4618.5 4627.1 4638.6 3856.1 3994.1 4005.9 4011.7 4058.4 5825.3 5845.8 5862.5 5869.3 5871.6 5152.9 5156.7 5159.7 5162.1 5180.9 6084.3 6189.8 6207.2 6277.2 6287.2 4211.2 4256.8 4256.8 4261.9 4268.8 6506.8 6626.3 6628.1 6628.6 6639.2 4214.1 4299.1 4342.1 4345.7 4346.8 4411.2 4422.2 4424.2 4425.0 4430.4 5112.4 5127.5 5135.7 5137.6 5146.0 6282.7 6286.8 6290.2 6299.3 6323.5 1542.8 1573.3 1579.7 1593.2 1599.3 1023.0 1034.1 1038.1 1044.6 1045.6 6179.8 6194.3 6195.5 6196.8 6206.8 6618.3 6626.1 6627.6 6636.1 6653.0 6143.5 6170.9 6184.4 6208.8 6210.3 3588.9 3662.2 3668.8 3677.5 3681.9 6709.3 6724.0 6749.8 6762.9 6767.5 6783.9 6794.0 6795.3 6795.9 6822.5 6529.3 6620.2 6737.2 6756.3 6758.1 6507.5 6527.4 6580.7 6598.1 6639.2 6447.0 6473.7 6479.0 6480.4 6491.1 6561.1 6715.9 6722.6 6747.9 6752.4 4322.5 4344.0 4348.8 4351.0 4355.8 6675.4 6676.0 6688.5 6691.7 6693.2 6299.1 6434.3 6446.7 6466.6 6488.5 6473.2 6497.5 6507.1 6518.9 6520.8 6324.2 6342.5 6347.1 6348.6 6356.7 6330.3 6484.8 6500.8 6509.3 6524.2 6262.1 6279.6 6279.8 6283.5 6293.5 16:42:19 INFO - 2015-11-05 16:42:19,829 DEBUG : BROWSER_OUTPUT: 16:42:19 INFO - 2015-11-05 16:42:19,829 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13612.95 Median:51898.37 stddev:16672.83 (32.1%) stddev-sans-first:16691.44 16:42:19 INFO - 2015-11-05 16:42:19,831 DEBUG : BROWSER_OUTPUT: Values: 706.6 729.6 748.5 769.4 792.3 13463.7 14040.9 14048.9 14054.4 14080.4 13407.8 13484.3 13490.5 13509.7 13519.9 720.6 728.5 909.6 913.7 933.6 900.0 902.9 911.6 911.8 912.0 980.8 985.9 986.3 986.9 987.7 748.4 758.2 928.9 946.3 946.4 704.7 705.2 705.6 705.6 706.7 13819.2 13994.7 14006.6 14013.9 14045.1 11770.5 11778.5 12092.5 12106.7 12107.6 9450.1 9489.3 9495.3 9521.1 9553.0 3265.7 3313.8 3314.6 3378.9 3440.7 48645.3 48890.0 49407.0 50354.5 50596.0 9029.6 9071.5 9153.0 9201.3 9658.7 12466.6 12591.7 12613.9 12629.6 19553.0 6310.2 6320.1 6344.0 6409.2 6433.6 3685.3 3756.4 3762.6 3774.5 3850.9 2672.1 2714.2 2722.6 2722.9 2723.2 411.4 411.6 420.6 420.7 421.8 572.7 583.9 598.9 611.6 620.1 7488.0 8221.5 8439.6 8573.4 8704.6 491.6 503.8 542.7 587.3 611.1 3817.5 3872.2 4145.0 4192.7 4291.0 60896.0 61816.4 61927.1 61945.7 62135.7 51790.0 52006.7 52107.0 52112.5 52919.7 48020.5 48040.5 48230.3 48283.5 48865.0 8019.6 8085.4 8179.2 8315.0 8458.0 35495.8 35837.6 35902.0 36112.0 36593.0 44062.0 44095.6 44595.3 45325.3 45432.1 7644.9 7804.3 7819.1 7900.7 8041.6 11162.8 11330.2 11341.2 11483.7 11488.2 10614.2 10992.1 10993.1 11512.7 11571.4 10486.7 10804.9 10913.2 11151.6 11231.7 7482.8 9862.0 10324.7 10435.9 11018.9 7907.4 8024.9 8302.3 8366.5 8567.7 8101.7 8865.9 8960.3 9132.5 9133.3 16:42:19 INFO - 2015-11-05 16:42:19,831 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:42:19 INFO - 2015-11-05 16:42:19,831 DEBUG : BROWSER_OUTPUT: 16:42:20 INFO - 2015-11-05 16:42:20,460 INFO : Browser exited with error code: 0 16:42:20 INFO - 2015-11-05 16:42:20,487 INFO : Completed test dromaeo_css (00:18:32) 16:42:20 INFO - 2015-11-05 16:42:20,487 INFO : Starting test kraken 16:42:20 INFO - 2015-11-05 16:42:20,487 DEBUG : operating with platform_type : mac_ 16:42:20 INFO - 2015-11-05 16:42:20,488 INFO : Initialising browser for kraken test... 16:42:20 INFO - 2015-11-05 16:42:20,500 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/tmpmCKwUp/profile http://localhost:56286/getInfo.html 16:42:22 INFO - 2015-11-05 16:42:22,634 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:42:22 INFO - 2015-11-05 16:42:22,634 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:42:22 INFO - 2015-11-05 16:42:22,634 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:42:22 INFO - 2015-11-05 16:42:22,634 DEBUG : BROWSER_OUTPUT: __metrics 16:42:22 INFO - 2015-11-05 16:42:22,641 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:42:23 INFO - 2015-11-05 16:42:23,292 INFO : Browser initialized. 16:42:23 INFO - 2015-11-05 16:42:23,292 INFO : Running cycle 1/1 for kraken test... 16:42:23 INFO - 2015-11-05 16:42:23,292 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/tmpmCKwUp/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:42:35 INFO - 2015-11-05 16:42:35,113 DEBUG : BROWSER_OUTPUT: RSS: Main: 220536832 16:42:35 INFO - 2015-11-05 16:42:35,114 DEBUG : BROWSER_OUTPUT: 16:42:37 INFO - 2015-11-05 16:42:37,636 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:56286/tests/kraken/driver.html?testName=audio-beat-detection) 16:42:38 INFO - 2015-11-05 16:42:38,222 DEBUG : BROWSER_OUTPUT: RSS: Main: 279474176 16:42:38 INFO - 2015-11-05 16:42:38,222 DEBUG : BROWSER_OUTPUT: 16:42:40 INFO - 2015-11-05 16:42:40,856 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:56286/tests/kraken/driver.html?testName=audio-dft) 16:42:41 INFO - 2015-11-05 16:42:41,440 DEBUG : BROWSER_OUTPUT: RSS: Main: 290897920 16:42:41 INFO - 2015-11-05 16:42:41,440 DEBUG : BROWSER_OUTPUT: 16:42:44 INFO - 2015-11-05 16:42:44,399 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:56286/tests/kraken/driver.html?testName=audio-fft) 16:42:44 INFO - 2015-11-05 16:42:44,963 DEBUG : BROWSER_OUTPUT: RSS: Main: 272883712 16:42:44 INFO - 2015-11-05 16:42:44,963 DEBUG : BROWSER_OUTPUT: 16:42:46 INFO - 2015-11-05 16:42:46,942 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:56286/tests/kraken/driver.html?testName=audio-oscillator) 16:42:47 INFO - 2015-11-05 16:42:47,530 DEBUG : BROWSER_OUTPUT: RSS: Main: 273281024 16:42:47 INFO - 2015-11-05 16:42:47,530 DEBUG : BROWSER_OUTPUT: 16:42:49 INFO - 2015-11-05 16:42:49,670 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:56286/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:42:50 INFO - 2015-11-05 16:42:50,240 DEBUG : BROWSER_OUTPUT: RSS: Main: 274706432 16:42:50 INFO - 2015-11-05 16:42:50,241 DEBUG : BROWSER_OUTPUT: 16:42:53 INFO - 2015-11-05 16:42:53,275 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:56286/tests/kraken/driver.html?testName=imaging-darkroom) 16:42:53 INFO - 2015-11-05 16:42:53,856 DEBUG : BROWSER_OUTPUT: RSS: Main: 276287488 16:42:53 INFO - 2015-11-05 16:42:53,856 DEBUG : BROWSER_OUTPUT: 16:42:56 INFO - 2015-11-05 16:42:56,963 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:56286/tests/kraken/driver.html?testName=imaging-desaturate) 16:42:57 INFO - 2015-11-05 16:42:57,543 DEBUG : BROWSER_OUTPUT: RSS: Main: 276373504 16:42:57 INFO - 2015-11-05 16:42:57,544 DEBUG : BROWSER_OUTPUT: 16:43:00 INFO - 2015-11-05 16:43:00,384 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:56286/tests/kraken/driver.html?testName=json-parse-financial) 16:43:00 INFO - 2015-11-05 16:43:00,959 DEBUG : BROWSER_OUTPUT: RSS: Main: 277000192 16:43:00 INFO - 2015-11-05 16:43:00,959 DEBUG : BROWSER_OUTPUT: 16:43:02 INFO - 2015-11-05 16:43:02,505 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:56286/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:43:03 INFO - 2015-11-05 16:43:03,082 DEBUG : BROWSER_OUTPUT: RSS: Main: 309161984 16:43:03 INFO - 2015-11-05 16:43:03,083 DEBUG : BROWSER_OUTPUT: 16:43:04 INFO - 2015-11-05 16:43:04,889 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:56286/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:43:05 INFO - 2015-11-05 16:43:05,504 DEBUG : BROWSER_OUTPUT: RSS: Main: 310083584 16:43:05 INFO - 2015-11-05 16:43:05,505 DEBUG : BROWSER_OUTPUT: 16:43:07 INFO - 2015-11-05 16:43:07,592 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:56286/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:43:08 INFO - 2015-11-05 16:43:08,166 DEBUG : BROWSER_OUTPUT: RSS: Main: 318296064 16:43:08 INFO - 2015-11-05 16:43:08,167 DEBUG : BROWSER_OUTPUT: 16:43:10 INFO - 2015-11-05 16:43:10,721 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:56286/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:43:11 INFO - 2015-11-05 16:43:11,313 DEBUG : BROWSER_OUTPUT: RSS: Main: 321970176 16:43:11 INFO - 2015-11-05 16:43:11,313 DEBUG : BROWSER_OUTPUT: 16:43:13 INFO - 2015-11-05 16:43:13,926 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:56286/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:43:14 INFO - 2015-11-05 16:43:14,508 DEBUG : BROWSER_OUTPUT: RSS: Main: 319938560 16:43:14 INFO - 2015-11-05 16:43:14,508 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,220 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:56286/tests/kraken/driver.html?testName=ai-astar) 16:43:16 INFO - 2015-11-05 16:43:16,474 DEBUG : BROWSER_OUTPUT: RSS: Main: 379260928 16:43:16 INFO - 2015-11-05 16:43:16,474 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,474 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:43:16 INFO - 2015-11-05 16:43:16,474 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:43:16 INFO - 2015-11-05 16:43:16,474 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:43:16 INFO - 2015-11-05 16:43:16,474 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:43:16 INFO - 2015-11-05 16:43:16,474 DEBUG : BROWSER_OUTPUT: |0;ai-astar;105;107;103;109;109;109;99;108;99;107 16:43:16 INFO - 2015-11-05 16:43:16,474 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;156;130;149;162;125;147;144;124;164;128 16:43:16 INFO - 2015-11-05 16:43:16,475 DEBUG : BROWSER_OUTPUT: |2;audio-dft;160;159;162;162;163;162;162;163;163;160 16:43:16 INFO - 2015-11-05 16:43:16,475 DEBUG : BROWSER_OUTPUT: |3;audio-fft;78;76;82;82;70;69;69;80;82;65 16:43:16 INFO - 2015-11-05 16:43:16,475 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;97;100;133;88;89;88;117;86;86;121 16:43:16 INFO - 2015-11-05 16:43:16,475 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;120;120;120;120;120;114;115;114;114;114 16:43:16 INFO - 2015-11-05 16:43:16,475 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;125;125;124;125;125;124;125;125;125;125 16:43:16 INFO - 2015-11-05 16:43:16,475 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;100;101;100;101;102;100;101;100;100;100 16:43:16 INFO - 2015-11-05 16:43:16,476 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;58;57;57;58;57;58;57;66;57;57 16:43:16 INFO - 2015-11-05 16:43:16,476 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;66;67;67;68;68;67;67;68;68;68 16:43:16 INFO - 2015-11-05 16:43:16,476 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;85;85;86;85;85;86;87;86;87;86 16:43:16 INFO - 2015-11-05 16:43:16,476 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;126;123;124;122;128;131;130;129;123;129 16:43:16 INFO - 2015-11-05 16:43:16,476 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;140;151;151;155;145;152;151;152;150;155 16:43:16 INFO - 2015-11-05 16:43:16,476 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;70;70;69;70;70;71;70;71;72;71 16:43:16 INFO - 2015-11-05 16:43:16,477 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:43:16 INFO - 2015-11-05 16:43:16,477 DEBUG : BROWSER_OUTPUT: __start_cc_report 16:43:16 INFO - 2015-11-05 16:43:16,477 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,893 16:43:16 INFO - 2015-11-05 16:43:16,477 DEBUG : BROWSER_OUTPUT: __end_cc_report 16:43:16 INFO - 2015-11-05 16:43:16,477 DEBUG : BROWSER_OUTPUT: __startTimestamp1446770596471__endTimestamp 16:43:16 INFO - 2015-11-05 16:43:16,478 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,478 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:43:16 INFO - 2015-11-05 16:43:16,478 DEBUG : BROWSER_OUTPUT: Number of tests: 14 16:43:16 INFO - 2015-11-05 16:43:16,478 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,478 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:105.50 Median:109.00 stddev:3.92 (3.6%) stddev-sans-first:4.16 16:43:16 INFO - 2015-11-05 16:43:16,478 DEBUG : BROWSER_OUTPUT: Values: 105.0 107.0 103.0 109.0 109.0 109.0 99.0 108.0 99.0 107.0 16:43:16 INFO - 2015-11-05 16:43:16,478 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,479 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:142.90 Median:148.00 stddev:15.29 (10.3%) stddev-sans-first:15.46 16:43:16 INFO - 2015-11-05 16:43:16,479 DEBUG : BROWSER_OUTPUT: Values: 156.0 130.0 149.0 162.0 125.0 147.0 144.0 124.0 164.0 128.0 16:43:16 INFO - 2015-11-05 16:43:16,479 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,479 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.60 Median:162.00 stddev:1.43 (0.9%) stddev-sans-first:1.39 16:43:16 INFO - 2015-11-05 16:43:16,481 DEBUG : BROWSER_OUTPUT: Values: 160.0 159.0 162.0 162.0 163.0 162.0 162.0 163.0 163.0 160.0 16:43:16 INFO - 2015-11-05 16:43:16,481 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,481 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:75.30 Median:79.00 stddev:6.48 (8.2%) stddev-sans-first:6.80 16:43:16 INFO - 2015-11-05 16:43:16,481 DEBUG : BROWSER_OUTPUT: Values: 78.0 76.0 82.0 82.0 70.0 69.0 69.0 80.0 82.0 65.0 16:43:16 INFO - 2015-11-05 16:43:16,481 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,481 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:100.50 Median:87.00 stddev:17.08 (19.6%) stddev-sans-first:18.07 16:43:16 INFO - 2015-11-05 16:43:16,481 DEBUG : BROWSER_OUTPUT: Values: 97.0 100.0 133.0 88.0 89.0 88.0 117.0 86.0 86.0 121.0 16:43:16 INFO - 2015-11-05 16:43:16,481 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,481 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:117.10 Median:120.00 stddev:3.07 (2.6%) stddev-sans-first:3.07 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: Values: 120.0 120.0 120.0 120.0 120.0 114.0 115.0 114.0 114.0 114.0 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:124.80 Median:125.00 stddev:0.42 (0.3%) stddev-sans-first:0.44 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: Values: 125.0 125.0 124.0 125.0 125.0 124.0 125.0 125.0 125.0 125.0 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:100.50 Median:100.50 stddev:0.71 (0.7%) stddev-sans-first:0.73 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: Values: 100.0 101.0 100.0 101.0 102.0 100.0 101.0 100.0 100.0 100.0 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:58.20 Median:57.50 stddev:2.78 (4.8%) stddev-sans-first:2.95 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: Values: 58.0 57.0 57.0 58.0 57.0 58.0 57.0 66.0 57.0 57.0 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.40 Median:68.00 stddev:0.70 (1.0%) stddev-sans-first:0.53 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: Values: 66.0 67.0 67.0 68.0 68.0 67.0 67.0 68.0 68.0 68.0 16:43:16 INFO - 2015-11-05 16:43:16,482 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.80 Median:86.00 stddev:0.79 (0.9%) stddev-sans-first:0.78 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: Values: 85.0 85.0 86.0 85.0 85.0 86.0 87.0 86.0 87.0 86.0 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:126.50 Median:128.50 stddev:3.31 (2.6%) stddev-sans-first:3.50 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: Values: 126.0 123.0 124.0 122.0 128.0 131.0 130.0 129.0 123.0 129.0 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.20 Median:151.50 stddev:4.54 (3.0%) stddev-sans-first:2.96 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: Values: 140.0 151.0 151.0 155.0 145.0 152.0 151.0 152.0 150.0 155.0 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.40 Median:70.50 stddev:0.84 (1.2%) stddev-sans-first:0.88 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: Values: 70.0 70.0 69.0 70.0 70.0 71.0 70.0 71.0 72.0 71.0 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:43:16 INFO - 2015-11-05 16:43:16,483 DEBUG : BROWSER_OUTPUT: 16:43:17 INFO - 2015-11-05 16:43:17,124 INFO : Browser exited with error code: 0 16:43:17 INFO - 2015-11-05 16:43:17,172 INFO : Completed test kraken (00:00:56) 16:43:17 INFO - 2015-11-05 16:43:17,172 INFO : Starting test v8_7 16:43:17 INFO - 2015-11-05 16:43:17,172 DEBUG : operating with platform_type : mac_ 16:43:17 INFO - 2015-11-05 16:43:17,173 INFO : Initialising browser for v8_7 test... 16:43:17 INFO - 2015-11-05 16:43:17,185 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/tmp_X9wLv/profile http://localhost:56286/getInfo.html 16:43:19 INFO - 2015-11-05 16:43:19,236 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 16:43:19 INFO - 2015-11-05 16:43:19,236 DEBUG : BROWSER_OUTPUT: colorDepth:24 16:43:19 INFO - 2015-11-05 16:43:19,236 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 16:43:19 INFO - 2015-11-05 16:43:19,236 DEBUG : BROWSER_OUTPUT: __metrics 16:43:19 INFO - 2015-11-05 16:43:19,256 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:43:19 INFO - 2015-11-05 16:43:19,910 INFO : Browser initialized. 16:43:19 INFO - 2015-11-05 16:43:19,911 INFO : Running cycle 1/1 for v8_7 test... 16:43:19 INFO - 2015-11-05 16:43:19,911 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/T/tmp_X9wLv/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 16:43:31 INFO - 2015-11-05 16:43:31,733 DEBUG : BROWSER_OUTPUT: RSS: Main: 221949952 16:43:31 INFO - 2015-11-05 16:43:31,733 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,154 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:56286/tests/v8_7/run.html (next: http://localhost:56286/tests/v8_7/run.html) 16:43:53 INFO - 2015-11-05 16:43:53,413 DEBUG : BROWSER_OUTPUT: RSS: Main: 295264256 16:43:53 INFO - 2015-11-05 16:43:53,414 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,414 DEBUG : BROWSER_OUTPUT: __start_tp_report 16:43:53 INFO - 2015-11-05 16:43:53,414 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 16:43:53 INFO - 2015-11-05 16:43:53,414 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 16:43:53 INFO - 2015-11-05 16:43:53,414 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 16:43:53 INFO - 2015-11-05 16:43:53,414 DEBUG : BROWSER_OUTPUT: |0;Richards;166.80567139282735 16:43:53 INFO - 2015-11-05 16:43:53,414 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;191.71779141104295 16:43:53 INFO - 2015-11-05 16:43:53,414 DEBUG : BROWSER_OUTPUT: |2;Encrypt;324.6753246753247 16:43:53 INFO - 2015-11-05 16:43:53,414 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5803.468208092486 16:43:53 INFO - 2015-11-05 16:43:53,415 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2066.115702479339 16:43:53 INFO - 2015-11-05 16:43:53,415 DEBUG : BROWSER_OUTPUT: |5;Earley;911.6575591985428 16:43:53 INFO - 2015-11-05 16:43:53,415 DEBUG : BROWSER_OUTPUT: |6;Boyer;12493.827160493827 16:43:53 INFO - 2015-11-05 16:43:53,415 DEBUG : BROWSER_OUTPUT: |7;RegExp;29705.882352941175 16:43:53 INFO - 2015-11-05 16:43:53,415 DEBUG : BROWSER_OUTPUT: |8;Splay;647.2491909385113 16:43:53 INFO - 2015-11-05 16:43:53,415 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;5786.127167630058 16:43:53 INFO - 2015-11-05 16:43:53,415 DEBUG : BROWSER_OUTPUT: __end_tp_report 16:43:53 INFO - 2015-11-05 16:43:53,415 DEBUG : BROWSER_OUTPUT: __startTimestamp1446770633407__endTimestamp 16:43:53 INFO - 2015-11-05 16:43:53,416 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,416 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 16:43:53 INFO - 2015-11-05 16:43:53,416 DEBUG : BROWSER_OUTPUT: Number of tests: 10 16:43:53 INFO - 2015-11-05 16:43:53,416 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,416 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:166.81 Median:166.81 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,416 DEBUG : BROWSER_OUTPUT: Values: 166.8 16:43:53 INFO - 2015-11-05 16:43:53,416 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,416 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:191.72 Median:191.72 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,416 DEBUG : BROWSER_OUTPUT: Values: 191.7 16:43:53 INFO - 2015-11-05 16:43:53,417 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,417 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:324.68 Median:324.68 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,417 DEBUG : BROWSER_OUTPUT: Values: 324.7 16:43:53 INFO - 2015-11-05 16:43:53,417 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,417 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5803.47 Median:5803.47 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,417 DEBUG : BROWSER_OUTPUT: Values: 5803.5 16:43:53 INFO - 2015-11-05 16:43:53,417 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,418 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2066.12 Median:2066.12 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,418 DEBUG : BROWSER_OUTPUT: Values: 2066.1 16:43:53 INFO - 2015-11-05 16:43:53,418 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,418 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:911.66 Median:911.66 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,418 DEBUG : BROWSER_OUTPUT: Values: 911.7 16:43:53 INFO - 2015-11-05 16:43:53,418 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,418 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12493.83 Median:12493.83 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,418 DEBUG : BROWSER_OUTPUT: Values: 12493.8 16:43:53 INFO - 2015-11-05 16:43:53,418 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:29705.88 Median:29705.88 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: Values: 29705.9 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:647.25 Median:647.25 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: Values: 647.2 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:5786.13 Median:5786.13 stddev:0.00 (0.0%) 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: Values: 5786.1 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 16:43:53 INFO - 2015-11-05 16:43:53,419 DEBUG : BROWSER_OUTPUT: 16:43:54 INFO - 2015-11-05 16:43:54,015 INFO : Browser exited with error code: 0 16:43:54 INFO - 2015-11-05 16:43:54,035 INFO : Completed test v8_7 (00:00:36) 16:43:54 INFO - 2015-11-05 16:43:54,078 INFO : Completed test suite (00:20:06) 16:43:54 INFO - 2015-11-05 16:43:54,078 DEBUG : Working with test: dromaeo_css 16:43:54 INFO - 2015-11-05 16:43:54,078 DEBUG : Generating results file: dromaeo_css 16:43:54 INFO - 2015-11-05 16:43:54,079 DEBUG : Working with test: kraken 16:43:54 INFO - 2015-11-05 16:43:54,079 DEBUG : Generating results file: kraken 16:43:54 INFO - 2015-11-05 16:43:54,079 INFO : javascript benchmark 16:43:54 INFO - 2015-11-05 16:43:54,079 DEBUG : Working with test: v8_7 16:43:54 INFO - 2015-11-05 16:43:54,079 DEBUG : Generating results file: v8_7 16:43:54 INFO - 2015-11-05 16:43:54,080 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:43:54 INFO - 2015-11-05 16:43:54,132 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,55]] 16:43:54 INFO - 2015-11-05 16:43:54,132 DEBUG : process_Request line: dromaeo_css 6719.13 graph.html#tests=[[72,64,55]] 16:43:54 INFO - 2015-11-05 16:43:54,132 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:43:54 INFO - 2015-11-05 16:43:54,160 DEBUG : process_Request line: kraken 1486.70 graph.html#tests=[[232,64,55]] 16:43:54 INFO - 2015-11-05 16:43:54,160 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:43:54 INFO - 2015-11-05 16:43:54,189 DEBUG : process_Request line: v8_7 18187.08 graph.html#tests=[[230,64,55]] 16:43:54 INFO - 2015-11-05 16:43:54,190 INFO : javascript benchmark 16:43:54 INFO - 2015-11-05 16:43:54,192 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [339.33490358896563, 341.48265377952407, 344.4729563767435, 344.6054267863295, 350.78251484079874, 14675.119492830438, 14972.026818256832, 17501.29994800208, 17621.237876212374, 18231.908840455795, 14363.856361436383, 15709.84290157098, 17539.91230043851, 17885.552861178443, 17963.0, 5292.179712144604, 5406.648567843097, 5421.756020979045, 5428.050091234038, 5441.5102640762325, 3924.2936271471126, 4046.210988857174, 5097.617678674096, 5297.814576489824, 5318.973405132969, 5625.943740562603, 5799.565032622549, 5812.767489300444, 5821.243238379005, 5840.06558950568, 5339.893202135955, 5801.854953626172, 5948.0, 5954.55340849438, 5958.493528050121, 5116.488351164891, 5120.231965205212, 5125.974370128163, 5127.128388174019, 5138.58891288696, 21433.14267429301, 21562.568748625097, 21730.348089557338, 21763.129474820988, 21895.233666821743, 1979.3666026871406, 2041.3671761753903, 2099.359695292935, 2106.147010460766, 2132.7867213278546, 13448.731025379439, 13533.458661653522, 13624.523141689993, 13967.720645587133, 14060.08609440383, 1632.8612067974236, 1688.4681325382464, 1737.539552018716, 1783.8929664220188, 1787.9106044697712, 58395.41604583985, 59818.99999999956, 60367.69816150891, 61201.693991529755, 61516.69241653808, 9457.0, 9629.662961796445, 9823.656172033945, 9855.408675479493, 9911.65309214174, 12008.279503229835, 12017.699557511132, 12027.819582706266, 12038.939805301092, 12043.337616431181, 5471.261379713767, 5522.116461366162, 5528.198411230349, 5600.803971860965, 7861.213878612093, 5827.6013756698085, 6027.126066720301, 6085.300190478063, 6138.78514252008, 6143.56995010345, 2980.7466365359187, 3000.369922316338, 3008.6389633244153, 3023.712747289004, 3028.6214223222096, 1006.8942761010135, 1049.459528342904, 1058.9682309530726, 1090.340344091829, 1107.8227483602584, 458.44070234314086, 472.4448772692073, 473.0987468871805, 479.86803629002304, 480.7404001838968, 11477.311361318347, 12059.879401206052, 12066.818997715041, 12067.637970860887, 12131.090168237417, 451.8463722334422, 456.13334664138404, 457.6796242630172, 464.27109438182407, 496.75162418790603, 6125.1731016313115, 6210.689465526796, 6223.066540019034, 6261.060840873814, 6275.717592708248, 526493.0, 533896.0, 535230.0, 539682.0, 560786.0, 71015.0, 72956.27043729495, 74221.6288918552, 74348.25651743522, 75449.24550754532, 496.29773869974304, 508.2452557951439, 508.98982020359387, 509.04299916157385, 509.2234342627523, 11100.167487438313, 11129.82150286292, 11172.888271117185, 11218.66344009681, 11237.550497980315, 34897.12757181091, 35000.82499587486, 35677.82161089178, 35812.28375432529, 35889.0, 47801.760991194824, 48032.0, 48052.27921581249, 48629.0, 48689.51310486991, 6048.969755151196, 6155.815325540241, 6234.625922444668, 6245.937540624717, 6322.778702745381, 11387.089032877184, 11786.292822430682, 11822.586209482626, 11842.585509507126, 11844.76310473803, 8497.320214382711, 8788.296936244957, 9083.0, 9453.763655908657, 10150.796984060426, 9812.116909478182, 9830.901690982999, 9945.900540994497, 10117.08946194846, 10218.489075546044, 10087.0, 10344.172466202535, 10440.947795260976, 10481.161507079567, 10482.266241363031, 6165.383461653799, 6346.111544383698, 6353.5870168438905, 6354.046892966092, 6360.141380913703, 9792.314537982273, 10143.137833284254, 10286.2799604027, 10310.32982856112, 10351.327163734635], "dojo.html": [3154.5899033125697, 3216.4371235033877, 3233.466478031125, 3264.069740124065, 3267.1342094345005, 5201.791928322872, 5286.524212820846, 5367.543758780504, 5398.6490878092945, 5435.646682965605, 5270.262163297141, 5273.841784746463, 5324.600654950875, 5328.813491527797, 5427.728613569326, 4921.237208232729, 4926.211806111023, 4937.5556199942, 4975.129352363322, 5064.822731204408, 4999.650024498268, 5135.050015747099, 5135.589152867761, 5156.3296771419855, 5159.5794868229705, 4852.975735121302, 4857.514248575149, 4951.183054795954, 4980.402351717817, 5034.496550344955, 5018.473060328686, 5020.322256495363, 5034.672746271517, 5070.138076527, 5103.4896510349035, 4981.950180498221, 4999.875003124915, 5012.924806127911, 5023.070731914608, 5029.119904016819, 5154.4587818278915, 5311.389190243094, 5312.4687531246955, 5319.760610772486, 5408.91886621701, 5709.0, 5717.628354157008, 5719.71401429931, 5731.111677689923, 5733.827985160452, 5787.913181302241, 5791.21818554494, 5798.797042103506, 5811.82564523065, 5818.0, 5210.348706411699, 5339.759710813023, 5353.2773075634295, 5355.6786592804165, 5363.919541206885, 5872.559558033165, 5883.794067207627, 5915.645061296336, 5915.881682366328, 5922.8815423691285, 5537.529310008614, 5636.887262254732, 5643.209950606918, 5648.604597678205, 5687.203791469197, 5804.767809287581, 5821.621594596422, 5829.358770535237, 5832.300123985064, 5857.062869940874, 5730.856728581735, 5733.082706766897, 5737.139429085587, 5742.684152371659, 5743.310802703702, 5484.890302194013, 5603.831885043455, 5613.719314034363, 5621.325440947031, 5734.053881109654, 4488.618467430305, 4496.977515112403, 4501.122281155143, 4513.119941611354, 4561.133384656904, 4081.3265811141423, 4105.035316700573, 4105.89735256615, 4138.193052354762, 4148.23257697327, 5325.121354976385, 5354.196870469461, 5428.4028756836715, 5439.972800135974, 5456.290682211366, 5794.159846822187, 5800.303963524319, 5802.593818432669, 5819.185314056035, 5822.010258256022, 5426.538744206708, 5429.701366424884, 5443.482869127427, 5453.563714902798, 5457.727113644302, 4894.853154405374, 4932.704037757746, 4997.675151115166, 5004.149294619923, 5060.696358218445, 5790.218320526675, 5803.100519419497, 5810.970945145332, 5830.825075247664, 5831.271091113611, 5730.1977723119635, 5736.713164341682, 5747.74135163927, 5754.251947246831, 5771.451712087345, 5734.741936612946, 5838.591298609056, 5839.5036421904615, 5846.912296315473, 5964.373740757158, 5777.7977770777825, 5781.132830075522, 5781.190633311424, 5802.100674395476, 5811.389804070681, 5848.356680765028, 5849.824505264849, 5851.590388672752, 5853.9121913172185, 5856.882862342644, 5415.160650099241, 5535.8892822144135, 5537.224788529689, 5581.246531718329, 5700.657960522216, 5626.381098079126, 5636.408177141341, 5680.602357835077, 5690.345610254708, 5695.943040569541, 5474.616776825744, 5544.833654990357, 5559.52744016747, 5565.638233514808, 5566.415526369835, 5521.3926468087675, 5589.608727389043, 5652.915206271827, 5672.12082127271, 5797.826065218051, 5533.280673512418, 5545.833624991256, 5547.528460080938, 5554.055810512142, 5560.638558493847], "mootools.html": [914.7347269291905, 1452.8329242137152, 1456.1190479759746, 1757.2707326459517, 1828.9392152551522, 7044.5421047631935, 7330.853382932338, 7459.738909138167, 7477.065366829146, 7479.027726395568, 7149.785506434815, 7338.449616278787, 7338.853222935538, 7364.189939106707, 7376.373008294288, 1916.3197065041918, 1947.7467929169188, 2183.355910006544, 2185.5519618478215, 2213.712217411742, 2229.6209644360497, 2233.36349140495, 2234.229190929127, 2236.452069243038, 2240.406292332533, 2169.652855543113, 2211.94470138247, 2214.4906671465574, 2217.2350539063996, 2219.012539419951, 1932.3043704266454, 1966.9016549172484, 2208.6466165413617, 2232.0625337358347, 2232.966505502419, 2220.4448887778058, 2236.37381533171, 2259.1641092795608, 2260.2654137405407, 2269.4099534121083, 7596.468247222697, 7627.046619172604, 7644.541327520366, 7647.158812530617, 7666.808329791744, 4746.288056791474, 4826.493218212107, 4829.227323628238, 4831.9275210871865, 4841.0, 2766.847823369734, 2827.8586070696383, 2868.4119755450083, 2912.577676236955, 2914.3734097169, 879.3888247667874, 896.3501461440469, 902.6795487601872, 905.3210092430677, 1486.873615742663, 9983.950080249624, 10041.799164016751, 10054.748631284203, 10065.345752526062, 10066.899331006669, 4177.206330797138, 4230.323148296319, 4248.702590818675, 4253.766042867672, 4295.484541854998, 8341.791455213546, 8347.373946954003, 8355.916440835514, 8359.456635318686, 8362.58187090643, 4788.928166077511, 4791.0, 4792.281157826354, 4794.640401969867, 4809.0, 4449.488308844459, 4450.488193857683, 4452.532484089124, 4457.264551349056, 4459.620932220798, 3293.5224392463438, 3388.8305584721156, 3407.3185362927516, 3426.777259478126, 3430.5711786026745, 1040.245821779204, 1043.7338478688039, 1050.5325130317087, 1054.3463052907246, 1055.5091882274778, 1330.5609148980814, 1332.6801567623895, 1336.6524703576945, 1368.856270091646, 1370.205280937054, 7364.668589913466, 7379.963100184465, 7521.097468303729, 7534.397248220129, 7536.962315188499, 1072.8498010278568, 1117.1788735279563, 1173.1084375874398, 1175.0893057880212, 1195.0, 5883.264591926009, 5904.822855314347, 5906.468417842415, 5921.822345329647, 5923.496502797224, 8777.473351598925, 9109.0, 9121.45271283725, 9132.406393584395, 9136.406133601295, 9015.323850711224, 9049.954750226207, 9056.275497960147, 9069.229115525122, 9092.636294548276, 7100.68046937889, 7133.179684336264, 7264.709411623476, 7272.090988626422, 7291.234420385889, 7022.613756243456, 7056.6118863463, 7059.5764254144915, 7065.0, 7070.045543851515, 7954.681812727426, 8168.0, 8195.754127376189, 8197.508149511048, 8202.425830191829, 7885.408594355561, 8025.9197408025175, 8040.638171282189, 8042.919570804217, 8050.597470126588, 6771.39057484809, 6923.169219693669, 6942.8611427772175, 6951.096357473698, 6957.060796792368, 7453.515521491086, 7481.625918704151, 7487.251274872469, 7502.587357695379, 7508.887366689395, 5950.494207992369, 6838.350356716104, 6955.930440695528, 7081.362677359062, 7084.645767711697, 6631.071649969104, 6708.865822683421, 6759.459243260626, 6819.0794242778575, 6936.479764017819, 6606.537542371988, 6680.866382672417, 6711.765088221889, 6722.831929201809, 6737.764178253934, 6346.841328966812, 6409.4231519163495, 6415.935840641534, 6418.037294405876, 6419.935800641933, 6470.38531339522, 6527.445167160655, 6533.640649764308, 6539.215294164731, 6564.8358791030605], "ext.html": [552.3951273355675, 558.210132662283, 564.0495764636588, 578.878435528539, 599.5413508665869, 31826.522602160956, 32465.837670811612, 32478.67521324786, 39835.203295934065, 40850.36598536055, 43265.0, 43750.78124609381, 43766.34350484745, 43770.781146094305, 43814.34278485825, 9421.952890235556, 9577.95211023944, 9604.855927161097, 9619.086186812277, 9623.133917947383, 8578.571071446433, 8736.257418119467, 9312.906870931305, 11046.668599941975, 11302.208845380826, 10922.235443518957, 10995.450227488594, 11018.338899666045, 11038.668839934775, 11097.11223102154, 8376.204260595294, 10848.620298289561, 10973.670789876316, 10997.395143267117, 11016.449177541172, 8186.590670466453, 11155.609553665663, 11457.828132578017, 11470.770584588261, 11476.426178691032, 40630.0, 41066.79466602678, 41069.0, 41102.79448602738, 41113.0, 3084.0593618946214, 3114.0, 3157.5737275467745, 3464.0, 3483.390406678821, 27992.720072799217, 28094.0, 28102.0, 28160.577591336147, 28231.294217644518, 2209.520389434212, 2217.789310015546, 2222.9555408891893, 2242.7196600424945, 2245.057076028072, 300605.0, 300635.0, 303201.0, 303670.0, 304542.47728761437, 56234.0, 57495.71252143796, 59422.0, 59832.0, 64259.67870160619, 61035.38964610297, 61575.38424615786, 61788.69105654443, 61804.0, 61814.0, 16897.15514224284, 17084.231209595597, 17095.145242737814, 17119.22963466647, 17119.57201069983, 13039.543615973396, 13109.213447193199, 13109.737805243842, 13118.0, 13137.408816603276, 19210.80789192118, 19256.711149332772, 19572.510687232934, 19607.705884411746, 19659.901700491693, 8357.498550087013, 8669.738007343312, 8672.739817805475, 8676.826463470696, 8748.65005399777, 945.281585994649, 1033.0495943731785, 1066.2429674930886, 1100.8458815765798, 1151.2401814802358, 29079.7092029077, 29456.606333938624, 29475.852620736758, 29562.40875182484, 29607.0, 1126.8929451702074, 1166.3643314393505, 1206.9336186509652, 1215.7629262293945, 1269.7968325067945, 15186.316615752317, 15358.462453814287, 15385.307661155275, 15512.224388780516, 15630.609234769221, 318316.0, 322000.0, 323858.0, 323874.0, 324407.0, 55241.44758552443, 55557.0, 55662.721686391305, 55688.44311556833, 55705.72147139238, 1387.1884947305737, 1402.9649258768613, 1419.822522184727, 1420.0911416693325, 1420.5454254638623, 28708.0, 28834.990775322764, 28891.56662650104, 29296.41407171802, 29427.264318392212, 49071.0, 49498.75250623724, 49550.0, 49571.25643115284, 49680.0, 288098.0, 289778.0, 290270.0, 290672.0, 290877.0, 27497.45005099847, 27907.302317442227, 31842.0, 32401.0, 33071.50392744159, 38016.239675206896, 38131.237375252895, 38309.4253586202, 38450.0, 38692.80653596714, 32410.0, 33104.83447582747, 33182.502262466565, 33222.0, 35917.461238081974, 32931.0, 34567.308653827284, 34902.0, 35655.93032209038, 35775.46336805002, 30912.0, 31341.529877051405, 35774.642253577134, 36313.45529817002, 36996.07509812276, 28961.275968100967, 31636.683633163375, 31695.08726147451, 31709.207269817518, 31776.364472709953, 24246.0, 24268.150614728398, 24339.63490547608, 24529.264122076365, 24583.754162458146], "prototype.html": [313.3591804759268, 322.60158704000554, 325.06867823685144, 328.9194147433879, 329.60118256909124, 6009.759609615621, 6040.244969378828, 6115.296740874801, 6116.296625888024, 6142.8464288392815, 5856.795012174574, 5987.4910632596175, 6009.128676341938, 6027.819165425033, 6080.179175811264, 4548.9090218195615, 4636.721796692209, 4642.930356044662, 4659.930101048487, 4676.508966558505, 4585.908281834361, 4637.9536204638025, 4657.673962822604, 4659.277811939155, 4665.673402861801, 4589.2886602576655, 4605.4933957264675, 4611.239145540982, 4613.1926912790295, 4622.514635963226, 4607.055553611518, 4611.193041217807, 4618.49196588375, 4627.1439783640135, 4638.605718513931, 3856.0745421098736, 3994.121293315466, 4005.8998525036814, 4011.7392369496183, 4058.391241313797, 5825.330087040003, 5845.795397161121, 5862.472377486004, 5869.325027621793, 5871.55963302754, 5152.896942061137, 5156.74216289184, 5159.664621799571, 5162.070827251093, 5180.896382072375, 6084.330723620398, 6189.783357582508, 6207.224096987877, 6277.183966084425, 6287.245530536319, 4211.178820130076, 4256.765877876715, 4256.829726810924, 4261.914761704779, 4268.807903644312, 6506.772262970773, 6626.304238055031, 6628.138342015507, 6628.635425051621, 6639.236487803916, 4214.072903961123, 4299.129878502861, 4342.0664557119735, 4345.67407444443, 4346.847860324873, 4411.205982923105, 4422.20400327944, 4424.225760491901, 4425.026494171278, 4430.446194225722, 5112.36095488064, 5127.4872512748425, 5135.666181698178, 5137.640365174402, 5146.0, 6282.654454004982, 6286.779962701375, 6290.245170579468, 6299.338569450233, 6323.494120470444, 1542.7591276647881, 1573.2841557091497, 1579.676166385911, 1593.1556275174175, 1599.2643384043238, 1023.0485648347109, 1034.0693375961544, 1038.065740833256, 1044.6291566493937, 1045.628801775374, 6179.783707570214, 6194.318624951252, 6195.504359651217, 6196.783112591038, 6206.844828879314, 6618.271990081087, 6626.138601981712, 6627.569208001464, 6636.13730215069, 6652.966735166293, 6143.539234557336, 6170.907436388457, 6184.350643182401, 6208.81373558794, 6210.285817131088, 3588.8923332300074, 3662.1943172502006, 3668.834902429344, 3677.5035370225214, 3681.944770828386, 6709.261981182066, 6724.0, 6749.763758268437, 6762.864742705118, 6767.526273160832, 6783.932160678429, 6794.0, 6795.286494918061, 6795.898061529081, 6822.488313376417, 6529.281779004401, 6620.238672552622, 6737.191537015589, 6756.2568117507035, 6758.05387245786, 6507.479401647952, 6527.412532872065, 6580.7038683260325, 6598.076269322395, 6639.170103737033, 6447.0, 6473.676316184266, 6479.0, 6480.384363485461, 6491.091247225298, 6561.1470508833545, 6715.865682686416, 6722.596644201363, 6747.932520674731, 6752.3922846944015, 4322.459692538433, 4344.0, 4348.804303806273, 4350.9564904350555, 4355.760433176079, 6675.399214070757, 6676.031975363448, 6688.498362622726, 6691.732330706912, 6693.163354580677, 6299.149614802126, 6434.260060093149, 6446.709898054505, 6466.612003279818, 6488.480921526361, 6473.2232132144445, 6497.5126865484335, 6507.056476810931, 6518.869622607616, 6520.836979075561, 6324.2410910691015, 6342.49260059185, 6347.079673447232, 6348.587341822767, 6356.68216589178, 6330.303666596578, 6484.837879053061, 6500.772472963424, 6509.349065093642, 6524.184476940382, 6262.09199666055, 6279.560430769985, 6279.811605651837, 6283.5287353449585, 6293.527985401205], "yui.html": [706.6043015911087, 729.6133049483775, 748.4910261022504, 769.3921801776595, 792.342355844649, 13463.663408414795, 14040.929795351021, 14048.929755351222, 14054.437822487114, 14080.436782528712, 13407.798883016763, 13484.325783710825, 13490.527831525898, 13509.662258443544, 13519.864801351983, 720.5928650312583, 728.4645785347765, 909.6497848328409, 913.7213149989267, 933.5985526223722, 899.9550022498881, 902.9187373136416, 911.5670056723037, 911.7857303533664, 912.0241341764315, 980.8332583460829, 985.9359141655806, 986.3292960786662, 986.8914419413894, 987.6839411388358, 748.4424104042496, 758.1773775453639, 928.8699582058483, 946.2619157057507, 946.356477595235, 704.7357241034612, 705.1960764728213, 705.5766540075965, 705.6471764117941, 706.6784613001072, 13819.170849749047, 13994.720105597933, 14006.649833754136, 14013.859861401357, 14045.08706934046, 11770.529178832836, 11778.528858845635, 12092.455839487244, 12106.697332566668, 12107.576234831738, 9450.149486546175, 9489.335746497747, 9495.335326527145, 9521.095495927875, 9552.95223523878, 3265.706086452207, 3313.8343082845763, 3314.5691060162026, 3378.946639358031, 3440.673136052071, 48645.270320945216, 48890.0, 49407.0, 50354.468097871, 50595.98808023856, 9029.593668284942, 9071.501067441353, 9152.95423522878, 9201.30990175726, 9658.661946831828, 12466.626001219978, 12591.685207869694, 12613.936930315289, 12629.621111366674, 19553.0, 6310.242770867525, 6320.115183874262, 6343.9682801585695, 6409.198850143732, 6433.581817181868, 3685.2997930393676, 3756.380197267475, 3762.6425489578446, 3774.5281839770028, 3850.942235866464, 2672.078133044097, 2714.24001279642, 2722.6324446199906, 2722.945541089207, 2723.237493501823, 411.4005419411014, 411.63570240337515, 420.62144070336944, 420.70550614569925, 421.7933212725804, 572.6764378126428, 583.9240898683144, 598.8862116197909, 611.5657882903099, 620.1163342237294, 7487.962560187273, 8221.54781487024, 8439.620217090245, 8573.356998225157, 8704.608292626846, 491.5944345914635, 503.7984806077598, 542.6581253810075, 587.2747157260779, 611.1291409741101, 3817.522809648794, 3872.225554888977, 4144.979275103666, 4192.685548583869, 4290.957090429119, 60896.0, 61816.38183618106, 61927.07109393363, 61945.690271549254, 62135.6893215531, 51790.0, 52006.73996630068, 52107.0, 52112.47887521076, 52919.735401323516, 48020.519794802305, 48040.519594803605, 48230.27654585184, 48283.5171648279, 48865.0, 8019.639116239667, 8085.353171746364, 8179.182081792012, 8314.958425207835, 8457.957710211409, 35495.82252088723, 35837.64162358343, 35902.0, 36112.0, 36593.0, 44062.0, 44095.55904440914, 44595.331070033324, 45325.32012019756, 45432.09135817199, 7644.885326719992, 7804.258595433652, 7819.1398946117015, 7900.68397264126, 8041.638126284214, 11162.776744465227, 11330.150238731963, 11341.206115571831, 11483.712907177052, 11488.19066740595, 10614.1508679307, 10992.065674417445, 10993.065589424668, 11512.654620361403, 11571.363575003455, 10486.674680646154, 10804.945975270073, 10913.23607347478, 11151.55393784272, 11231.71920701989, 7482.812929676802, 9862.0, 10324.741881453023, 10435.94782026085, 11018.889811102106, 7907.446478746432, 8024.919750802417, 8302.335813134814, 8366.456180348257, 8567.657293708182, 8101.675932962616, 8865.867011994696, 8960.32797540174, 9132.497712625604, 9133.315001375056]}, "summary": {"suite": 6719.13773990864, "subtests": {"jquery.html": {"filtered": 7268.902523844462, "value": 7268.902523844462}, "dojo.html": {"filtered": 5331.860940767288, "value": 5331.860940767288}, "mootools.html": {"filtered": 4394.034335628889, "value": 4394.034335628889}, "ext.html": {"filtered": 18821.630396088138, "value": 18821.630396088138}, "prototype.html": {"filtered": 4781.444749045454, "value": 4781.444749045454}, "yui.html": {"filtered": 6003.649375429818, "value": 6003.649375429818}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0004"}, "testrun": {"date": 1446769427, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151105140536", "branch": "Fx-Team", "revision": "319e09c9668b8d2937c49dabdfd84a30d8771ac1"}}, {"talos_counters": {}, "results": {"audio-dft": [160.0, 159.0, 162.0, 162.0, 163.0, 162.0, 162.0, 163.0, 163.0, 160.0], "ai-astar": [105.0, 107.0, 103.0, 109.0, 109.0, 109.0, 99.0, 108.0, 99.0, 107.0], "imaging-gaussian-blur": [120.0, 120.0, 120.0, 120.0, 120.0, 114.0, 115.0, 114.0, 114.0, 114.0], "audio-beat-detection": [156.0, 130.0, 149.0, 162.0, 125.0, 147.0, 144.0, 124.0, 164.0, 128.0], "json-stringify-tinderbox": [66.0, 67.0, 67.0, 68.0, 68.0, 67.0, 67.0, 68.0, 68.0, 68.0], "stanford-crypto-pbkdf2": [140.0, 151.0, 151.0, 155.0, 145.0, 152.0, 151.0, 152.0, 150.0, 155.0], "json-parse-financial": [58.0, 57.0, 57.0, 58.0, 57.0, 58.0, 57.0, 66.0, 57.0, 57.0], "stanford-crypto-sha256-iterative": [70.0, 70.0, 69.0, 70.0, 70.0, 71.0, 70.0, 71.0, 72.0, 71.0], "audio-fft": [78.0, 76.0, 82.0, 82.0, 70.0, 69.0, 69.0, 80.0, 82.0, 65.0], "imaging-darkroom": [125.0, 125.0, 124.0, 125.0, 125.0, 124.0, 125.0, 125.0, 125.0, 125.0], "stanford-crypto-ccm": [126.0, 123.0, 124.0, 122.0, 128.0, 131.0, 130.0, 129.0, 123.0, 129.0], "audio-oscillator": [97.0, 100.0, 133.0, 88.0, 89.0, 88.0, 117.0, 86.0, 86.0, 121.0], "stanford-crypto-aes": [85.0, 85.0, 86.0, 85.0, 85.0, 86.0, 87.0, 86.0, 87.0, 86.0], "imaging-desaturate": [100.0, 101.0, 100.0, 101.0, 102.0, 100.0, 101.0, 100.0, 100.0, 100.0]}, "summary": {"suite": 1486.7, "subtests": {"audio-fft": {"filtered": 75.3, "value": 75.3}, "stanford-crypto-pbkdf2": {"filtered": 150.2, "value": 150.2}, "audio-beat-detection": {"filtered": 142.9, "value": 142.9}, "stanford-crypto-ccm": {"filtered": 126.5, "value": 126.5}, "imaging-darkroom": {"filtered": 124.8, "value": 124.8}, "json-parse-financial": {"filtered": 58.2, "value": 58.2}, "audio-oscillator": {"filtered": 100.5, "value": 100.5}, "ai-astar": {"filtered": 105.5, "value": 105.5}, "audio-dft": {"filtered": 161.6, "value": 161.6}, "stanford-crypto-sha256-iterative": {"filtered": 70.4, "value": 70.4}, "json-stringify-tinderbox": {"filtered": 67.4, "value": 67.4}, "imaging-gaussian-blur": {"filtered": 117.1, "value": 117.1}, "stanford-crypto-aes": {"filtered": 85.8, "value": 85.8}, "imaging-desaturate": {"filtered": 100.5, "value": 100.5}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0004"}, "testrun": {"date": 1446769427, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151105140536", "branch": "Fx-Team", "revision": "319e09c9668b8d2937c49dabdfd84a30d8771ac1"}}, {"talos_counters": {}, "results": {"DeltaBlue": [191.71779141104295], "Encrypt": [324.6753246753247], "NavierStokes": [5786.127167630058], "Decrypt": [5803.468208092486], "Splay": [647.2491909385113], "Richards": [166.80567139282735], "RegExp": [29705.882352941175], "Earley": [911.6575591985428], "Boyer": [12493.827160493827], "RayTrace": [2066.115702479339]}, "summary": {"suite": 18187.08445912429, "subtests": {"DeltaBlue": {"filtered": 344.87148800000006, "value": 344.87148800000006}, "Encrypt": {"filtered": 819.8374799999998, "value": 819.8374799999998}, "NavierStokes": {"filtered": 256.4755244755246, "value": 256.4755244755246}, "Decrypt": {"filtered": 45.865849601593595, "value": 45.865849601593595}, "Splay": {"filtered": 125.90359500000004, "value": 125.90359500000004}, "RegExp": {"filtered": 30.66682178217823, "value": 30.66682178217823}, "Richards": {"filtered": 211.6354900000001, "value": 211.6354900000001}, "Earley": {"filtered": 731.0453286713289, "value": 731.0453286713289}, "Boyer": {"filtered": 53.34338241106715, "value": 53.34338241106715}, "RayTrace": {"filtered": 358.1546759999999, "value": 358.1546759999999}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0004"}, "testrun": {"date": 1446769427, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151105140536", "branch": "Fx-Team", "revision": "319e09c9668b8d2937c49dabdfd84a30d8771ac1"}}] 16:43:54 INFO - RETURN: dromaeo_css: 6719.13 16:43:54 INFO - RETURN: kraken: 1486.70 16:43:54 INFO - RETURN: v8_7: 18187.08 16:43:54 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,55]]", "result": "18187.08"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,55]]", "result": "1486.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,55]]", "result": "6719.13"}}} 16:43:54 INFO - Return code: 0 16:43:54 INFO - # TBPL SUCCESS # 16:43:54 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 16:43:54 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 16:43:54 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 16:43:54 INFO - 2015-11-05 16:43:54.326 screenresolution[1953:20037] starting screenresolution argv=screenresolution get 16:43:54 INFO - 2015-11-05 16:43:54.330 screenresolution[1953:20037] Display 0: 1600x1200x32@60 16:43:54 INFO - 2015-11-05 16:43:54.337 screenresolution[1954:20040] starting screenresolution argv=screenresolution list 16:43:54 INFO - Available Modes on Display 0 16:43:54 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 16:43:54 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 16:43:54 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 16:43:54 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 16:43:54 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 16:43:54 INFO - Intel HD Graphics 3000: 16:43:54 INFO - Chipset Model: Intel HD Graphics 3000 16:43:54 INFO - Type: GPU 16:43:54 INFO - Bus: Built-In 16:43:54 INFO - VRAM (Total): 512 MB 16:43:54 INFO - VRAM (Dynamic, Max): 10 16:43:54 INFO - Vendor: Intel (0x8086) 16:43:54 INFO - Device ID: 0x0116 16:43:54 INFO - Revision ID: 0x0009 16:43:54 INFO - Displays: 16:43:54 INFO - Display: 16:43:54 INFO - Resolution: 1600 x 1200 @ 60 Hz 16:43:54 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 16:43:54 INFO - Display Serial Number: 1600x1200 60 16:43:54 INFO - Main Display: Yes 16:43:54 INFO - Mirror: Off 16:43:54 INFO - Online: Yes 16:43:54 INFO - Rotation: Supported 16:43:54 INFO - Return code: 0 16:43:54 INFO - Running post-action listener: _resource_record_post_action 16:43:54 INFO - Running post-run listener: _resource_record_post_run 16:43:55 INFO - Total resource usage - Wall time: 1243s; CPU: 30.0%; Read bytes: 81920; Write bytes: 683844608; Read time: 128; Write time: 18374 16:43:55 INFO - install - Wall time: 36s; CPU: 30.0%; Read bytes: 336638464; Write bytes: 335013888; Read time: 30594; Write time: 5174 16:43:55 INFO - run-tests - Wall time: 1208s; CPU: 30.0%; Read bytes: 81920; Write bytes: 337648640; Read time: 128; Write time: 12933 16:43:55 INFO - Running post-run listener: _upload_blobber_files 16:43:55 INFO - Blob upload gear active. 16:43:55 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 16:43:55 INFO - Copying logs to upload dir... 16:43:55 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1294.693797 ========= master_lag: 2.69 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 37 secs) (at 2015-11-05 16:43:58.403969) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-05 16:43:58.407790) ========= 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.jXp44zOcdH/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.tp4DB8h2wj/Listeners TMPDIR=/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/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:0x0:0x0 using PTY: False build_url:https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.009828 build_url: 'https://queue.taskcluster.net/v1/task/bpFw7qZKRZK_bDs3CS3XBg/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.23 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-05 16:43:58.648322) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:43:58.648765) ========= 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.jXp44zOcdH/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.tp4DB8h2wj/Listeners TMPDIR=/var/folders/c_/4qswg5nn3tj5gfvq2qh065bm00000w/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:0x0:0x0 using PTY: False program finished with exit code 0 elapsedTime=0.005227 ========= master_lag: 0.02 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-05 16:43:58.677772) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-05 16:43:58.678083) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-05 16:43:58.678507) ========= ========= Total master_lag: 8.15 =========