builder: fx-team_yosemite_test-dromaeojs slave: t-yosemite-r5-0034 starttime: 1447335781.66 results: success (0) buildid: 20151112034048 builduid: d33e27a2577640ba9af2fa3e5c2d3c81 revision: 8921c18fecfc098d8dceec686a05345054e299e0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.662570) ========= master: http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.663163) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.663563) ========= 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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners TMPDIR=/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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.006624 basedir: '/builds/slave/test' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.698262) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.699042) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.717241) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.717815) ========= 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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners TMPDIR=/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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.005715 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.769644) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.770236) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.770734) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.771174) ========= 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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners TMPDIR=/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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-12 05:43:01-- 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% 1.26G=0s 2015-11-12 05:43:01 (1.26 GB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.124657 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.913636) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.914077) ========= 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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners TMPDIR=/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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.021768 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.964915) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:01.965398) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 8921c18fecfc098d8dceec686a05345054e299e0 --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 8921c18fecfc098d8dceec686a05345054e299e0 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners TMPDIR=/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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-12 05:43:02,052 truncating revision to first 12 chars 2015-11-12 05:43:02,053 Setting DEBUG logging. 2015-11-12 05:43:02,053 attempt 1/10 2015-11-12 05:43:02,053 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/8921c18fecfc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-12 05:43:02,312 unpacking tar archive at: fx-team-8921c18fecfc/testing/mozharness/ program finished with exit code 0 elapsedTime=0.537789 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:02.522161) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:02.522585) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:02.537486) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:02.537990) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-12 05:43:02.538581) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 0 secs) (at 2015-11-12 05:43:02.538972) ========= /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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners TMPDIR=/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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 05:43:02 INFO - MultiFileLogger online at 20151112 05:43:02 in /builds/slave/test 05:43:02 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 05:43:02 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:43:02 INFO - {'append_to_log': False, 05:43:02 INFO - 'base_work_dir': '/builds/slave/test', 05:43:02 INFO - 'blob_upload_branch': 'Fx-Team', 05:43:02 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:43:02 INFO - 'branch': 'Fx-Team', 05:43:02 INFO - 'buildbot_json_path': 'buildprops.json', 05:43:02 INFO - 'config_files': ('talos/mac_config.py',), 05:43:02 INFO - 'default_actions': ('clobber', 05:43:02 INFO - 'read-buildbot-config', 05:43:02 INFO - 'download-and-extract', 05:43:02 INFO - 'populate-webroot', 05:43:02 INFO - 'create-virtualenv', 05:43:02 INFO - 'install', 05:43:02 INFO - 'run-tests'), 05:43:02 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:43:02 INFO - 'download_minidump_stackwalk': True, 05:43:02 INFO - 'download_symbols': 'ondemand', 05:43:02 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:43:02 INFO - 'tooltool.py': '/tools/tooltool.py', 05:43:02 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:43:02 INFO - '/tools/misc-python/virtualenv.py')}, 05:43:02 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:43:02 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:43:02 INFO - 'installer_path': 'installer.exe', 05:43:02 INFO - 'log_level': 'info', 05:43:02 INFO - 'log_name': 'talos', 05:43:02 INFO - 'log_to_console': True, 05:43:02 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 05:43:02 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 05:43:02 INFO - 'opt_config_files': (), 05:43:02 INFO - 'pip_index': False, 05:43:02 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:43:02 INFO - 'cmd': ('bash', 05:43:02 INFO - '-c', 05:43:02 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:43:02 INFO - 'enabled': True, 05:43:02 INFO - 'halt_on_failure': False, 05:43:02 INFO - 'name': 'check_screen_resolution'},), 05:43:02 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 05:43:02 INFO - 'cmd': ('bash', 05:43:02 INFO - '-c', 05:43:02 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 05:43:02 INFO - 'enabled': True, 05:43:02 INFO - 'halt_on_failure': False, 05:43:02 INFO - 'name': 'check_screen_resolution'},), 05:43:02 INFO - 'run_cmd_checks_enabled': True, 05:43:02 INFO - 'sps_profile': False, 05:43:02 INFO - 'sps_profile_interval': 0, 05:43:02 INFO - 'suite': 'dromaeojs', 05:43:02 INFO - 'system_bits': '64', 05:43:02 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:43:02 INFO - 'title': 't-yosemite-r5-0034', 05:43:02 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:43:02 INFO - 'use_talos_json': True, 05:43:02 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:43:02 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:43:02 INFO - 'work_dir': 'build'} 05:43:02 INFO - ##### 05:43:02 INFO - ##### Running clobber step. 05:43:02 INFO - ##### 05:43:02 INFO - Running pre-action listener: _resource_record_pre_action 05:43:02 INFO - Running main action method: clobber 05:43:02 INFO - rmtree: /builds/slave/test/build 05:43:02 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:43:04 INFO - Running post-action listener: _resource_record_post_action 05:43:04 INFO - ##### 05:43:04 INFO - ##### Running read-buildbot-config step. 05:43:04 INFO - ##### 05:43:04 INFO - Running pre-action listener: _resource_record_pre_action 05:43:04 INFO - Running main action method: read_buildbot_config 05:43:04 INFO - Using buildbot properties: 05:43:04 INFO - { 05:43:04 INFO - "properties": { 05:43:04 INFO - "buildnumber": 1340, 05:43:04 INFO - "product": "firefox", 05:43:04 INFO - "script_repo_revision": "production", 05:43:04 INFO - "builddir": "fx-team_yosemite_test-dromaeojs", 05:43:04 INFO - "repository": "", 05:43:04 INFO - "buildername": "Rev5 MacOSX Yosemite 10.10 fx-team talos dromaeojs", 05:43:04 INFO - "buildid": "20151112034048", 05:43:04 INFO - "slavename": "t-yosemite-r5-0034", 05:43:04 INFO - "pgo_build": "False", 05:43:04 INFO - "basedir": "/builds/slave/test", 05:43:04 INFO - "project": "", 05:43:04 INFO - "platform": "yosemite", 05:43:04 INFO - "master": "http://buildbot-master107.bb.releng.scl3.mozilla.com:8201/", 05:43:04 INFO - "slavebuilddir": "test", 05:43:04 INFO - "scheduler": "tests-fx-team-macosx64-talos", 05:43:04 INFO - "branch": "fx-team", 05:43:04 INFO - "repo_path": "integration/fx-team", 05:43:04 INFO - "stage_platform": "macosx64", 05:43:04 INFO - "builduid": "d33e27a2577640ba9af2fa3e5c2d3c81", 05:43:04 INFO - "revision": "8921c18fecfc098d8dceec686a05345054e299e0" 05:43:04 INFO - }, 05:43:04 INFO - "sourcestamp": { 05:43:04 INFO - "repository": "", 05:43:04 INFO - "hasPatch": false, 05:43:04 INFO - "project": "", 05:43:04 INFO - "branch": "fx-team-macosx64-talos", 05:43:04 INFO - "changes": [ 05:43:04 INFO - { 05:43:04 INFO - "category": null, 05:43:04 INFO - "files": [ 05:43:04 INFO - { 05:43:04 INFO - "url": null, 05:43:04 INFO - "name": "https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg" 05:43:04 INFO - } 05:43:04 INFO - ], 05:43:04 INFO - "repository": "", 05:43:04 INFO - "rev": "8921c18fecfc098d8dceec686a05345054e299e0", 05:43:04 INFO - "who": "cbook@mozilla.com", 05:43:04 INFO - "when": 1447334551, 05:43:04 INFO - "number": 6653442, 05:43:04 INFO - "comments": "Merge mozilla-central to fx-team", 05:43:04 INFO - "project": "", 05:43:04 INFO - "at": "Thu 12 Nov 2015 05:22:31", 05:43:04 INFO - "branch": "fx-team-macosx64-talos", 05:43:04 INFO - "revlink": "", 05:43:04 INFO - "properties": [ 05:43:04 INFO - [ 05:43:04 INFO - "buildid", 05:43:04 INFO - "20151112034048", 05:43:04 INFO - "Change" 05:43:04 INFO - ], 05:43:04 INFO - [ 05:43:04 INFO - "builduid", 05:43:04 INFO - "d33e27a2577640ba9af2fa3e5c2d3c81", 05:43:04 INFO - "Change" 05:43:04 INFO - ], 05:43:04 INFO - [ 05:43:04 INFO - "pgo_build", 05:43:04 INFO - "False", 05:43:04 INFO - "Change" 05:43:04 INFO - ] 05:43:04 INFO - ], 05:43:04 INFO - "revision": "8921c18fecfc098d8dceec686a05345054e299e0" 05:43:04 INFO - } 05:43:04 INFO - ], 05:43:04 INFO - "revision": "8921c18fecfc098d8dceec686a05345054e299e0" 05:43:04 INFO - } 05:43:04 INFO - } 05:43:04 INFO - Found installer url https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg. 05:43:04 INFO - Running post-action listener: _resource_record_post_action 05:43:04 INFO - ##### 05:43:04 INFO - ##### Running download-and-extract step. 05:43:04 INFO - ##### 05:43:04 INFO - Running pre-action listener: _resource_record_pre_action 05:43:04 INFO - Running main action method: download_and_extract 05:43:04 INFO - mkdir: /builds/slave/test/build/tests 05:43:04 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')]} 05:43:04 INFO - https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:43:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/test_packages.json 05:43:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/test_packages.json 05:43:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 05:43:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 05:43:05 INFO - Downloaded 1149 bytes. 05:43:05 INFO - Reading from file /builds/slave/test/build/test_packages.json 05:43:05 INFO - Using the following test package requirements: 05:43:05 INFO - {u'common': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 05:43:05 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:43:05 INFO - u'firefox-45.0a1.en-US.mac.cppunittest.tests.zip'], 05:43:05 INFO - u'jittest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:43:05 INFO - u'jsshell-mac.zip'], 05:43:05 INFO - u'mochitest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:43:05 INFO - u'firefox-45.0a1.en-US.mac.mochitest.tests.zip'], 05:43:05 INFO - u'mozbase': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 05:43:05 INFO - u'reftest': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:43:05 INFO - u'firefox-45.0a1.en-US.mac.reftest.tests.zip'], 05:43:05 INFO - u'talos': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:43:05 INFO - u'firefox-45.0a1.en-US.mac.talos.tests.zip'], 05:43:05 INFO - u'web-platform': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:43:05 INFO - u'firefox-45.0a1.en-US.mac.web-platform.tests.zip'], 05:43:05 INFO - u'webapprt': [u'firefox-45.0a1.en-US.mac.common.tests.zip'], 05:43:05 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.mac.common.tests.zip', 05:43:05 INFO - u'firefox-45.0a1.en-US.mac.xpcshell.tests.zip']} 05:43:05 INFO - Downloading packages: [u'firefox-45.0a1.en-US.mac.common.tests.zip'] for test suite category: common 05:43: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')]} 05:43:05 INFO - https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 05:43:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:43:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:43:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/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 05:43:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/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 05:43:06 INFO - Downloaded 17454948 bytes. 05:43:06 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 05:43:06 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:43:06 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 05:43:12 INFO - Return code: 0 05:43:12 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 05:43:12 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')]} 05:43:12 INFO - https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip matches https://queue.taskcluster.net 05:43:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:43:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:43:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/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 05:43:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/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 05:43:13 INFO - Downloaded 17454948 bytes. 05:43:13 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 05:43:13 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip 05:43:13 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.common.tests.zip'] with output_timeout 1760 05:43:21 INFO - Return code: 0 05:43:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:43:21 INFO - https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip matches https://queue.taskcluster.net 05:43:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 05:43:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.talos.tests.zip 05:43:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/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 05:43:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/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 05:43:22 INFO - Downloaded 11131693 bytes. 05:43:22 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 05:43:22 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip 05:43:22 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.mac.talos.tests.zip'] with output_timeout 1760 05:43:23 INFO - Return code: 0 05:43:23 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')]} 05:43:23 INFO - https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg matches https://queue.taskcluster.net 05:43:23 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 05:43:23 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 05:43:23 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-45.0a1.en-US.mac.dmg 05:43:23 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/2WYrRlklSa-Vci6AfbHjSA/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 05:43:26 INFO - Downloaded 108707645 bytes. 05:43:26 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 05:43:26 INFO - mkdir: /builds/slave/test/properties 05:43:26 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:43:26 INFO - Writing to file /builds/slave/test/properties/build_url 05:43:26 INFO - Contents: 05:43:26 INFO - build_url:https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg 05:43:26 INFO - Running post-action listener: _resource_record_post_action 05:43:26 INFO - Running post-action listener: set_extra_try_arguments 05:43:26 INFO - ##### 05:43:26 INFO - ##### Running populate-webroot step. 05:43:26 INFO - ##### 05:43:26 INFO - Running pre-action listener: _resource_record_pre_action 05:43:26 INFO - Running main action method: populate_webroot 05:43:26 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:43:26 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:43:26 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 05:43:26 INFO - '../fennec_ids.txt'], 05:43:26 INFO - 'tests': ['tcheck2']}, 05:43:26 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:43:26 INFO - '--tppagecycles', 05:43:26 INFO - '7'], 05:43:26 INFO - 'tests': ['tsvgm']}}, 05:43:26 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:43:26 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:43:26 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:43:26 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:43:26 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:43:26 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:43:26 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:43:26 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:43:26 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:43:26 INFO - 'talos_options': ['--e10s'], 05:43:26 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:43:26 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:43:26 INFO - 'tests': ['damp', 'tps']}, 05:43:26 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:43:26 INFO - 'talos_options': ['--e10s'], 05:43:26 INFO - 'tests': ['damp', 'tps']}, 05:43:26 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:43:26 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:43:26 INFO - 'other': {'tests': ['a11yr', 05:43:26 INFO - 'ts_paint', 05:43:26 INFO - 'tpaint', 05:43:26 INFO - 'sessionrestore', 05:43:26 INFO - 'sessionrestore_no_auto_restore']}, 05:43:26 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:43:26 INFO - 'tests': ['a11yr', 05:43:26 INFO - 'ts_paint', 05:43:26 INFO - 'tpaint', 05:43:26 INFO - 'sessionrestore', 05:43:26 INFO - 'sessionrestore_no_auto_restore']}, 05:43:26 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:43:26 INFO - 'tests': ['a11yr', 05:43:26 INFO - 'ts_paint', 05:43:26 INFO - 'tpaint', 05:43:26 INFO - 'sessionrestore', 05:43:26 INFO - 'sessionrestore_no_auto_restore']}, 05:43:26 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:43:26 INFO - 'tests': ['a11yr', 05:43:26 INFO - 'ts_paint', 05:43:26 INFO - 'tpaint', 05:43:26 INFO - 'sessionrestore', 05:43:26 INFO - 'sessionrestore_no_auto_restore']}, 05:43:26 INFO - 'other_l64': {'tests': ['a11yr', 05:43:26 INFO - 'ts_paint', 05:43:26 INFO - 'tpaint', 05:43:26 INFO - 'sessionrestore', 05:43:26 INFO - 'sessionrestore_no_auto_restore']}, 05:43:26 INFO - 'other_nol64': {'tests': ['a11yr', 05:43:26 INFO - 'ts_paint', 05:43:26 INFO - 'tpaint', 05:43:26 INFO - 'sessionrestore', 05:43:26 INFO - 'sessionrestore_no_auto_restore']}, 05:43:26 INFO - 'svgr': {'tests': ['tsvgx', 05:43:26 INFO - 'tsvgr_opacity', 05:43:26 INFO - 'tart', 05:43:26 INFO - 'tscrollx', 05:43:26 INFO - 'cart']}, 05:43:26 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:43:26 INFO - 'tests': ['tsvgx', 05:43:26 INFO - 'tsvgr_opacity', 05:43:26 INFO - 'tart', 05:43:26 INFO - 'tscrollx', 05:43:26 INFO - 'cart']}, 05:43:26 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:43:26 INFO - 'tests': ['tp5o']}, 05:43:26 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:43:26 INFO - 'talos_options': ['--e10s'], 05:43:26 INFO - 'tests': ['tp5o']}, 05:43:26 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:43:26 INFO - 'talos_options': ['--xperf_path', 05:43:26 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:43:26 INFO - 'tests': ['tp5n']}, 05:43:26 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:43:26 INFO - 'talos_options': ['--e10s', 05:43:26 INFO - '--xperf_path', 05:43:26 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:43:26 INFO - 'tests': ['tp5n']}}, 05:43:26 INFO - 'talos.zip': {'path': '', 05:43:26 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:43:26 INFO - Running post-action listener: _resource_record_post_action 05:43:26 INFO - ##### 05:43:26 INFO - ##### Running create-virtualenv step. 05:43:26 INFO - ##### 05:43:26 INFO - Running pre-action listener: _resource_record_pre_action 05:43:26 INFO - Running main action method: create_virtualenv 05:43:26 INFO - Creating virtualenv /builds/slave/test/build/venv 05:43:26 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 05:43:26 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:43:26 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:43:26 INFO - Using real prefix '/tools/python27' 05:43:26 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:43:27 INFO - Installing distribute.............................................................................................................................................................................................done. 05:43:31 INFO - Installing pip.................done. 05:43:31 INFO - Return code: 0 05:43:31 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:43: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')]} 05:43:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:43:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43: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')]} 05:43:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:43:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:31 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 0x1087c3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1087a0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faee858c0a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1086e69f0>, '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 0x108446db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1086da8c8>, '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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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 05:43:31 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 05:43:31 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 05:43:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4LzGGnxJQI/Render', 05:43:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:43:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:43:31 INFO - 'HOME': '/Users/cltbld', 05:43:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:43:31 INFO - 'LOGNAME': 'cltbld', 05:43:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:43:31 INFO - 'MOZ_NO_REMOTE': '1', 05:43:31 INFO - 'NO_EM_RESTART': '1', 05:43:31 INFO - 'PAGER': '/bin/cat', 05:43:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:43:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:43:31 INFO - 'PWD': '/builds/slave/test', 05:43:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:43:31 INFO - 'SHELL': '/bin/bash', 05:43:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.S4pfjpQ3pV/Listeners', 05:43:31 INFO - 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/', 05:43:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:43:31 INFO - 'USER': 'cltbld', 05:43:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:43:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:43:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:43:31 INFO - 'XPC_FLAGS': '0x0', 05:43:31 INFO - 'XPC_SERVICE_NAME': '0', 05:43:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:43:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:43:32 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 05:43:32 INFO - Cleaning up... 05:43:32 INFO - Return code: 0 05:43:32 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 05:43:32 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')]} 05:43:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:43:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:32 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')]} 05:43:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:43:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:32 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 0x1087c3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1087a0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faee858c0a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1086e69f0>, '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 0x108446db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1086da8c8>, '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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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 05:43:32 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 05:43:32 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 05:43:32 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4LzGGnxJQI/Render', 05:43:32 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:43:32 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:43:32 INFO - 'HOME': '/Users/cltbld', 05:43:32 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:43:32 INFO - 'LOGNAME': 'cltbld', 05:43:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:43:32 INFO - 'MOZ_NO_REMOTE': '1', 05:43:32 INFO - 'NO_EM_RESTART': '1', 05:43:32 INFO - 'PAGER': '/bin/cat', 05:43:32 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:43:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:43:32 INFO - 'PWD': '/builds/slave/test', 05:43:32 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:43:32 INFO - 'SHELL': '/bin/bash', 05:43:32 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.S4pfjpQ3pV/Listeners', 05:43:32 INFO - 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/', 05:43:32 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:43:32 INFO - 'USER': 'cltbld', 05:43:32 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:43:32 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:43:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:43:32 INFO - 'XPC_FLAGS': '0x0', 05:43:32 INFO - 'XPC_SERVICE_NAME': '0', 05:43:32 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:43:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:43:32 INFO - Downloading/unpacking psutil>=0.7.1 05:43:32 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 05:43:32 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 05:43:32 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 05:43:32 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 05:43:32 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 05:43:32 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 05:43:35 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 05:43:35 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 05:43:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:43:35 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:43:35 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:43:35 INFO - Installing collected packages: psutil 05:43:35 INFO - Running setup.py install for psutil 05:43:35 INFO - building 'psutil._psutil_osx' extension 05:43:35 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 05:43:35 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 05:43:36 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 05:43:36 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 05:43:36 INFO - building 'psutil._psutil_posix' extension 05:43:36 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 05:43:36 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 05:43:36 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 05:43:36 INFO - ^ 05:43:36 INFO - 1 warning generated. 05:43:36 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 05:43:36 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:43:36 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:43:36 INFO - Successfully installed psutil 05:43:36 INFO - Cleaning up... 05:43:36 INFO - Return code: 0 05:43:36 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 05:43:36 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')]} 05:43:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:43:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:36 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')]} 05:43:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:43:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:36 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 0x1087c3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1087a0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faee858c0a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1086e69f0>, '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 0x108446db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1086da8c8>, '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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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 05:43:36 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 05:43:36 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 05:43:36 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4LzGGnxJQI/Render', 05:43:36 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:43:36 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:43:36 INFO - 'HOME': '/Users/cltbld', 05:43:36 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:43:36 INFO - 'LOGNAME': 'cltbld', 05:43:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:43:36 INFO - 'MOZ_NO_REMOTE': '1', 05:43:36 INFO - 'NO_EM_RESTART': '1', 05:43:36 INFO - 'PAGER': '/bin/cat', 05:43:36 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:43:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:43:36 INFO - 'PWD': '/builds/slave/test', 05:43:36 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:43:36 INFO - 'SHELL': '/bin/bash', 05:43:36 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.S4pfjpQ3pV/Listeners', 05:43:36 INFO - 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/', 05:43:36 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:43:36 INFO - 'USER': 'cltbld', 05:43:36 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:43:36 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:43:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:43:36 INFO - 'XPC_FLAGS': '0x0', 05:43:36 INFO - 'XPC_SERVICE_NAME': '0', 05:43:36 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:43:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:43:36 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:43:36 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 05:43:36 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 05:43:36 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 05:43:36 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 05:43:36 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 05:43:36 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 05:43:39 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:43:39 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 05:43:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:43:39 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:43:39 INFO - Installing collected packages: mozsystemmonitor 05:43:39 INFO - Running setup.py install for mozsystemmonitor 05:43:39 INFO - Successfully installed mozsystemmonitor 05:43:39 INFO - Cleaning up... 05:43:40 INFO - Return code: 0 05:43:40 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:43: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')]} 05:43:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:43:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43: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')]} 05:43:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:43:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:40 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 0x1087c3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1087a0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faee858c0a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1086e69f0>, '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 0x108446db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1086da8c8>, '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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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 05:43:40 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 05:43:40 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 05:43:40 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4LzGGnxJQI/Render', 05:43:40 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:43:40 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:43:40 INFO - 'HOME': '/Users/cltbld', 05:43:40 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:43:40 INFO - 'LOGNAME': 'cltbld', 05:43:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:43:40 INFO - 'MOZ_NO_REMOTE': '1', 05:43:40 INFO - 'NO_EM_RESTART': '1', 05:43:40 INFO - 'PAGER': '/bin/cat', 05:43:40 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:43:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:43:40 INFO - 'PWD': '/builds/slave/test', 05:43:40 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:43:40 INFO - 'SHELL': '/bin/bash', 05:43:40 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.S4pfjpQ3pV/Listeners', 05:43:40 INFO - 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/', 05:43:40 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:43:40 INFO - 'USER': 'cltbld', 05:43:40 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:43:40 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:43:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:43:40 INFO - 'XPC_FLAGS': '0x0', 05:43:40 INFO - 'XPC_SERVICE_NAME': '0', 05:43:40 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:43:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:43:40 INFO - Downloading/unpacking blobuploader==1.2.4 05:43:40 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 05:43:40 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 05:43:40 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 05:43:40 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 05:43:40 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 05:43:40 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 05:43:43 INFO - Downloading blobuploader-1.2.4.tar.gz 05:43:43 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 05:43:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:43:43 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:43:43 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 05:43:43 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 05:43:43 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 05:43:43 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 05:43:43 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 05:43:43 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 05:43:43 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 05:43:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:43:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:43:44 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 05:43:44 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 05:43:44 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 05:43:44 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 05:43:44 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 05:43:44 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 05:43:44 INFO - Downloading docopt-0.6.1.tar.gz 05:43:44 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 05:43:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:43:44 INFO - Installing collected packages: blobuploader, requests, docopt 05:43:44 INFO - Running setup.py install for blobuploader 05:43:44 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:43:44 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:43:44 INFO - Running setup.py install for requests 05:43:45 INFO - Running setup.py install for docopt 05:43:45 INFO - Successfully installed blobuploader requests docopt 05:43:45 INFO - Cleaning up... 05:43:45 INFO - Return code: 0 05:43:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:43:45 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')]} 05:43:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:43:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:45 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')]} 05:43:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:43:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:45 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 0x1087c3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1087a0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faee858c0a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1086e69f0>, '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 0x108446db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1086da8c8>, '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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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 05:43:45 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 05:43:45 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 05:43:45 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4LzGGnxJQI/Render', 05:43:45 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:43:45 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:43:45 INFO - 'HOME': '/Users/cltbld', 05:43:45 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:43:45 INFO - 'LOGNAME': 'cltbld', 05:43:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:43:45 INFO - 'MOZ_NO_REMOTE': '1', 05:43:45 INFO - 'NO_EM_RESTART': '1', 05:43:45 INFO - 'PAGER': '/bin/cat', 05:43:45 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:43:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:43:45 INFO - 'PWD': '/builds/slave/test', 05:43:45 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:43:45 INFO - 'SHELL': '/bin/bash', 05:43:45 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.S4pfjpQ3pV/Listeners', 05:43:45 INFO - 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/', 05:43:45 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:43:45 INFO - 'USER': 'cltbld', 05:43:45 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:43:45 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:43:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:43:45 INFO - 'XPC_FLAGS': '0x0', 05:43:45 INFO - 'XPC_SERVICE_NAME': '0', 05:43:45 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:43:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:43:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:43:46 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-cjkpNN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:43:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:43:46 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-ubD1aW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:43:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:43:46 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-BfdpK8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:43:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:43:46 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-Trqh84-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:43:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:43:46 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-YVUknJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:43:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:43:46 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-lna6ly-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:43:46 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:43:46 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-3_Lg3h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:43:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:43:47 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-J80193-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:43:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:43:47 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-LfeWBO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:43:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:43:47 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-CBqHCH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:43:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:43:47 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-ll3IVH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:43:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:43:47 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-ryiD9u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:43:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:43:47 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-V3vzAm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:43:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:43:47 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-rmqR51-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:43:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:43:48 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-S0Gnvc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:43:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:43:48 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-s6g0_c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:43:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:43:48 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-M4pTTI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:43:48 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:43:48 INFO - Running setup.py install for manifestparser 05:43:48 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:43:48 INFO - Running setup.py install for mozcrash 05:43:48 INFO - Running setup.py install for mozdebug 05:43:49 INFO - Running setup.py install for mozdevice 05:43:49 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 05:43:49 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:43:49 INFO - Running setup.py install for mozfile 05:43:49 INFO - Running setup.py install for mozhttpd 05:43:49 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:43:49 INFO - Running setup.py install for mozinfo 05:43:49 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:43:49 INFO - Running setup.py install for mozInstall 05:43:50 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:43:50 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:43:50 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:43:50 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:43:50 INFO - Running setup.py install for mozleak 05:43:50 INFO - Running setup.py install for mozlog 05:43:50 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:43:50 INFO - Running setup.py install for moznetwork 05:43:50 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:43:50 INFO - Running setup.py install for mozprocess 05:43:50 INFO - Running setup.py install for mozprofile 05:43:51 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:43:51 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:43:51 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:43:51 INFO - Running setup.py install for mozrunner 05:43:51 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:43:51 INFO - Running setup.py install for mozscreenshot 05:43:51 INFO - Running setup.py install for moztest 05:43:51 INFO - Running setup.py install for mozversion 05:43:51 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:43:51 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:43:51 INFO - Cleaning up... 05:43:51 INFO - Return code: 0 05:43:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:43:51 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')]} 05:43:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:43:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:51 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')]} 05:43:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:43:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:51 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 0x1087c3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1087a0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faee858c0a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1086e69f0>, '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 0x108446db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1086da8c8>, '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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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 05:43:51 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 05:43:51 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 05:43:51 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4LzGGnxJQI/Render', 05:43:51 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:43:51 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:43:51 INFO - 'HOME': '/Users/cltbld', 05:43:51 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:43:51 INFO - 'LOGNAME': 'cltbld', 05:43:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:43:51 INFO - 'MOZ_NO_REMOTE': '1', 05:43:51 INFO - 'NO_EM_RESTART': '1', 05:43:51 INFO - 'PAGER': '/bin/cat', 05:43:51 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:43:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:43:51 INFO - 'PWD': '/builds/slave/test', 05:43:51 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:43:51 INFO - 'SHELL': '/bin/bash', 05:43:51 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.S4pfjpQ3pV/Listeners', 05:43:51 INFO - 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/', 05:43:51 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:43:51 INFO - 'USER': 'cltbld', 05:43:51 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:43:51 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:43:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:43:51 INFO - 'XPC_FLAGS': '0x0', 05:43:51 INFO - 'XPC_SERVICE_NAME': '0', 05:43:51 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:43:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:43:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:43:52 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-2az0iU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:43:52 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)) 05:43:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:43:52 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-S_Lmb9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:43:52 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)) 05:43:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:43:52 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-ugRgZm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:43:52 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)) 05:43:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:43:52 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-pyfhC4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:43:52 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)) 05:43:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:43:52 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-n5JZDg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:43:52 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)) 05:43:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:43:52 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-RCyo5h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:43:53 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)) 05:43:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:43:53 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-3TkuYn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:43:53 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)) 05:43:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:43:53 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-8VAJ8P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:43:53 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)) 05:43:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:43:53 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-KYYqSj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:43:53 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)) 05:43:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:43:53 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-swJD2D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:43:53 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)) 05:43:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:43:53 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-lZmuMZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:43:53 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)) 05:43:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:43:53 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-reeWs1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:43:53 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)) 05:43:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:43:53 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-OuFNYz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:43:54 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)) 05:43:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:43:54 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-K3RzMy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:43:54 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)) 05:43:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:43:54 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-qOM2is-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:43:54 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)) 05:43:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:43:54 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-zyUmUh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:43:54 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)) 05:43:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:43:54 INFO - Running setup.py (path:/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/pip-tpnC2n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:43:54 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)) 05:43:54 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)) 05:43:54 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)) 05:43:54 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)) 05:43:54 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)) 05:43:54 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)) 05:43:54 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:43:54 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 05:43:54 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 05:43:54 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 05:43:54 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 05:43:54 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 05:43:54 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 05:43:57 INFO - Downloading blessings-1.5.1.tar.gz 05:43:57 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 05:43:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:43:57 INFO - Installing collected packages: blessings 05:43:57 INFO - Running setup.py install for blessings 05:43:57 INFO - Successfully installed blessings 05:43:57 INFO - Cleaning up... 05:43:57 INFO - Return code: 0 05:43:57 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:43:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:43:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:43:58 INFO - Reading from file tmpfile_stdout 05:43:58 INFO - Current package versions: 05:43:58 INFO - blessings == 1.5.1 05:43:58 INFO - blobuploader == 1.2.4 05:43:58 INFO - docopt == 0.6.1 05:43:58 INFO - manifestparser == 1.1 05:43:58 INFO - mozInstall == 1.12 05:43:58 INFO - mozcrash == 0.16 05:43:58 INFO - mozdebug == 0.1 05:43:58 INFO - mozdevice == 0.47 05:43:58 INFO - mozfile == 1.2 05:43:58 INFO - mozhttpd == 0.7 05:43:58 INFO - mozinfo == 0.9 05:43:58 INFO - mozleak == 0.1 05:43:58 INFO - mozlog == 3.0 05:43:58 INFO - moznetwork == 0.27 05:43:58 INFO - mozprocess == 0.22 05:43:58 INFO - mozprofile == 0.27 05:43:58 INFO - mozrunner == 6.11 05:43:58 INFO - mozscreenshot == 0.1 05:43:58 INFO - mozsystemmonitor == 0.0 05:43:58 INFO - moztest == 0.7 05:43:58 INFO - mozversion == 1.4 05:43:58 INFO - psutil == 3.1.1 05:43:58 INFO - requests == 1.2.3 05:43:58 INFO - wsgiref == 0.1.2 05:43:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:43:58 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')]} 05:43:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:43:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:58 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')]} 05:43:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:43:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:43:58 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 0x1087c3490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1087a0228>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7faee858c0a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1086e69f0>, '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 0x108446db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1086da8c8>, '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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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 05:43:58 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 05:43:58 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 05:43:58 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4LzGGnxJQI/Render', 05:43:58 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:43:58 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:43:58 INFO - 'HOME': '/Users/cltbld', 05:43:58 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:43:58 INFO - 'LOGNAME': 'cltbld', 05:43:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:43:58 INFO - 'MOZ_NO_REMOTE': '1', 05:43:58 INFO - 'NO_EM_RESTART': '1', 05:43:58 INFO - 'PAGER': '/bin/cat', 05:43:58 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:43:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:43:58 INFO - 'PWD': '/builds/slave/test', 05:43:58 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:43:58 INFO - 'SHELL': '/bin/bash', 05:43:58 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.S4pfjpQ3pV/Listeners', 05:43:58 INFO - 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/', 05:43:58 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:43:58 INFO - 'USER': 'cltbld', 05:43:58 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:43:58 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:43:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:43:58 INFO - 'XPC_FLAGS': '0x0', 05:43:58 INFO - 'XPC_SERVICE_NAME': '0', 05:43:58 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:43:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:43:58 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)) 05:43:58 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)) 05:43:58 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)) 05:43:58 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)) 05:43:58 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)) 05:43:58 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)) 05:43:58 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)) 05:43:58 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)) 05:43:58 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)) 05:43:58 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)) 05:43:58 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)) 05:43:58 INFO - Cleaning up... 05:43:58 INFO - Return code: 0 05:43:58 INFO - Running post-action listener: _resource_record_post_action 05:43:58 INFO - Running post-action listener: _start_resource_monitoring 05:43:58 INFO - Starting resource monitoring. 05:43:58 INFO - ##### 05:43:58 INFO - ##### Running install step. 05:43:58 INFO - ##### 05:43:58 INFO - Running pre-action listener: _resource_record_pre_action 05:43:58 INFO - Running main action method: install 05:43:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:43:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:43:58 INFO - Reading from file tmpfile_stdout 05:43:58 INFO - Detecting whether we're running mozinstall >=1.0... 05:43:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:43:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:43:59 INFO - Reading from file tmpfile_stdout 05:43:59 INFO - Output received: 05:43:59 INFO - Usage: mozinstall [options] installer 05:43:59 INFO - Options: 05:43:59 INFO - -h, --help show this help message and exit 05:43:59 INFO - -d DEST, --destination=DEST 05:43:59 INFO - Directory to install application into. [default: 05:43:59 INFO - "/builds/slave/test"] 05:43:59 INFO - --app=APP Application being installed. [default: firefox] 05:43:59 INFO - mkdir: /builds/slave/test/build/application 05:43:59 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'] 05:43:59 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 05:44:41 INFO - Reading from file tmpfile_stdout 05:44:41 INFO - Output received: 05:44:41 INFO - /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox 05:44:41 INFO - Running post-action listener: _resource_record_post_action 05:44:41 INFO - ##### 05:44:41 INFO - ##### Running run-tests step. 05:44:41 INFO - ##### 05:44:41 INFO - Running pre-action listener: _resource_record_pre_action 05:44:41 INFO - Running main action method: run_tests 05:44:41 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 05:44:41 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 05:44:41 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 05:44:41 INFO - 2015-11-12 05:44:41.150 screenresolution[1939:16168] starting screenresolution argv=screenresolution get 05:44:41 INFO - 2015-11-12 05:44:41.154 screenresolution[1939:16168] Display 0: 1600x1200x32@60 05:44:41 INFO - 2015-11-12 05:44:41.161 screenresolution[1940:16170] starting screenresolution argv=screenresolution list 05:44:41 INFO - Available Modes on Display 0 05:44:41 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 05:44:41 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 05:44:41 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 05:44:41 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 05:44:41 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 05:44:41 INFO - Intel HD Graphics 3000: 05:44:41 INFO - Chipset Model: Intel HD Graphics 3000 05:44:41 INFO - Type: GPU 05:44:41 INFO - Bus: Built-In 05:44:41 INFO - VRAM (Total): 512 MB 05:44:41 INFO - VRAM (Dynamic, Max): 10 05:44:41 INFO - Vendor: Intel (0x8086) 05:44:41 INFO - Device ID: 0x0116 05:44:41 INFO - Revision ID: 0x0009 05:44:41 INFO - Displays: 05:44:41 INFO - Display: 05:44:41 INFO - Resolution: 1600 x 1200 @ 60 Hz 05:44:41 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 05:44:41 INFO - Display Serial Number: 1600x1200 60 05:44:41 INFO - Main Display: Yes 05:44:41 INFO - Mirror: Off 05:44:41 INFO - Online: Yes 05:44:41 INFO - Rotation: Supported 05:44:41 INFO - Return code: 0 05:44:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:44:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:44:41 INFO - Python 2.7.3 05:44:41 INFO - Return code: 0 05:44:41 INFO - grabbing minidump binary from tooltool 05:44:41 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')]} 05:44:41 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 0x1086e69f0>, '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 0x108446db0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1086da8c8>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:44:41 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 05:44:41 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 05:44:41 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:44:41 INFO - Return code: 0 05:44:41 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 05:44:41 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:44:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:44:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 05:44:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:44:41 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/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0034', '--webServer', 'localhost'] in /builds/slave/test/build 05:44:41 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/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r5-0034 --webServer localhost 05:44:41 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.4LzGGnxJQI/Render', 05:44:41 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 05:44:41 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 05:44:41 INFO - 'HOME': '/Users/cltbld', 05:44:41 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 05:44:41 INFO - 'LOGNAME': 'cltbld', 05:44:41 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:44:41 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 05:44:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:44:41 INFO - 'MOZ_NO_REMOTE': '1', 05:44:41 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:44:41 INFO - 'NO_EM_RESTART': '1', 05:44:41 INFO - 'PAGER': '/bin/cat', 05:44:41 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 05:44:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:44:41 INFO - 'PWD': '/builds/slave/test', 05:44:41 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:44:41 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 05:44:41 INFO - 'SHELL': '/bin/bash', 05:44:41 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.S4pfjpQ3pV/Listeners', 05:44:41 INFO - 'TMPDIR': '/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/', 05:44:41 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 05:44:41 INFO - 'USER': 'cltbld', 05:44:41 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 05:44:41 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 05:44:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:44:41 INFO - 'XPC_FLAGS': '0x0', 05:44:41 INFO - 'XPC_SERVICE_NAME': '0', 05:44:41 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0x0:0x0'} 05:44:41 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/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r5-0034', '--webServer', 'localhost'] with output_timeout 3600 05:44:41 INFO - mozversion INFO | application_buildid: 20151112034048 05:44:41 INFO - mozversion INFO | application_changeset: 8921c18fecfc098d8dceec686a05345054e299e0 05:44:41 INFO - mozversion INFO | application_display_name: Nightly 05:44:41 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:44:41 INFO - mozversion INFO | application_name: Firefox 05:44:41 INFO - mozversion INFO | application_remotingname: firefox 05:44:41 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 05:44:41 INFO - mozversion INFO | application_vendor: Mozilla 05:44:41 INFO - mozversion INFO | application_version: 45.0a1 05:44:41 INFO - mozversion INFO | platform_buildid: 20151112034048 05:44:41 INFO - mozversion INFO | platform_changeset: 8921c18fecfc098d8dceec686a05345054e299e0 05:44:41 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 05:44:41 INFO - mozversion INFO | platform_version: 45.0a1 05:44:41 INFO - 2015-11-12 05:44:41,838 DEBUG : using testdate: 1447335881 05:44:41 INFO - 2015-11-12 05:44:41,838 DEBUG : actual date: 1447335881 05:44:41 INFO - 2015-11-12 05:44:41,887 INFO : starting webserver on 'localhost:51237' 05:44:41 INFO - 2015-11-12 05:44:41,888 INFO : Starting test suite t-yosemite-r5-0034 05:44:41 INFO - 2015-11-12 05:44:41,888 INFO : Starting test dromaeo_css 05:44:41 INFO - 2015-11-12 05:44:41,888 DEBUG : operating with platform_type : mac_ 05:44:41 INFO - 2015-11-12 05:44:41,889 INFO : Initialising browser for dromaeo_css test... 05:44:41 INFO - 2015-11-12 05:44:41,918 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/tmp2afXnN/profile http://localhost:51237/getInfo.html 05:44:45 INFO - 2015-11-12 05:44:45,154 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:44:45 INFO - 2015-11-12 05:44:45,155 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:44:45 INFO - 2015-11-12 05:44:45,155 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 05:44:45 INFO - 2015-11-12 05:44:45,155 DEBUG : BROWSER_OUTPUT: __metrics 05:44:45 INFO - 2015-11-12 05:44:45,170 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:44:45 INFO - 2015-11-12 05:44:45,947 INFO : Browser initialized. 05:44:45 INFO - 2015-11-12 05:44:45,948 INFO : Running cycle 1/1 for dromaeo_css test... 05:44:45 INFO - 2015-11-12 05:44:45,948 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/tmp2afXnN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:44:58 INFO - 2015-11-12 05:44:58,287 DEBUG : BROWSER_OUTPUT: RSS: Main: 229380096 05:44:58 INFO - 2015-11-12 05:44:58,287 DEBUG : BROWSER_OUTPUT: 05:45:50 INFO - 2015-11-12 05:45:50,030 DEBUG : BROWSER_OUTPUT: 1447335950029 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] 05:47:59 INFO - 2015-11-12 05:47:59,866 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51237/tests/dromaeo/cssquery-ext.html) 05:48:01 INFO - 2015-11-12 05:48:01,123 DEBUG : BROWSER_OUTPUT: RSS: Main: 339918848 05:48:01 INFO - 2015-11-12 05:48:01,123 DEBUG : BROWSER_OUTPUT: 05:51:04 INFO - 2015-11-12 05:51:04,073 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/dromaeo/cssquery-ext.html (next: http://localhost:51237/tests/dromaeo/cssquery-jquery.html) 05:51:04 INFO - 2015-11-12 05:51:04,659 DEBUG : BROWSER_OUTPUT: RSS: Main: 361394176 05:51:04 INFO - 2015-11-12 05:51:04,659 DEBUG : BROWSER_OUTPUT: 05:54:07 INFO - 2015-11-12 05:54:07,034 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51237/tests/dromaeo/cssquery-mootools.html) 05:54:07 INFO - 2015-11-12 05:54:07,622 DEBUG : BROWSER_OUTPUT: RSS: Main: 356823040 05:54:07 INFO - 2015-11-12 05:54:07,622 DEBUG : BROWSER_OUTPUT: 05:57:09 INFO - 2015-11-12 05:57:09,829 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51237/tests/dromaeo/cssquery-prototype.html) 05:57:10 INFO - 2015-11-12 05:57:10,421 DEBUG : BROWSER_OUTPUT: RSS: Main: 319537152 05:57:10 INFO - 2015-11-12 05:57:10,422 DEBUG : BROWSER_OUTPUT: 06:00:13 INFO - 2015-11-12 06:00:13,509 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51237/tests/dromaeo/cssquery-yui.html) 06:00:14 INFO - 2015-11-12 06:00:14,118 DEBUG : BROWSER_OUTPUT: RSS: Main: 319250432 06:00:14 INFO - 2015-11-12 06:00:14,118 DEBUG : BROWSER_OUTPUT: 06:03:17 INFO - 2015-11-12 06:03:17,045 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/dromaeo/cssquery-yui.html (next: http://localhost:51237/tests/dromaeo/cssquery-dojo.html) 06:03:17 INFO - 2015-11-12 06:03:17,312 DEBUG : BROWSER_OUTPUT: RSS: Main: 368099328 06:03:17 INFO - 2015-11-12 06:03:17,312 DEBUG : BROWSER_OUTPUT: 06:03:17 INFO - 2015-11-12 06:03:17,312 DEBUG : BROWSER_OUTPUT: __start_tp_report 06:03:17 INFO - 2015-11-12 06:03:17,312 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 06:03:17 INFO - 2015-11-12 06:03:17,313 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 06:03:17 INFO - 2015-11-12 06:03:17,313 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 06:03:17 INFO - 2015-11-12 06:03:17,314 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2577.768000879921;2648.033467784258;2657.3223827923875;2672.412069344745;2673.9598906016413;4334.4798624165105;4384.517703052662;4449.799759010844;4469.128519938613;4501.437320334958;4289.871303860881;4334.41485399471;4364.869053928379;4365.934510982338;4488.596026357627;3956.7273305253143;4053.2298863215897;4163.229802486535;4222.535521092677;4293.849715259967;4194.161167766459;4250.404943307939;4298.957010429903;4321.546237645033;4323.200207961521;4046.150308435232;4094.1197642506704;4097;4176.832926682929;4229.006183546864;4171.311733563958;4227.704060715751;4255.063885945087;4259.424977628011;4284.014676624394;4194.2869712149;4195.769232692201;4197.601227883346;4203.957960420387;4266.104118135196;4218.599233072884;4346.521882592912;4420.712653677533;4425.491068527096;4471.5081341052455;4664.323673067386;4676.3453116563705;4718.8584342469785;4768.117898188846;4773.045390921795;4754.477007529169;4804.903901921977;4819.42166939966;4868.172410690191;4880.511948805127;4315;4315.935260971088;4415.955840441555;4456.08650226706;4466.665000125004;4761.285807128958;4842.370491836109;4844.467108618049;4879.878003049952;4897.853064408074;4682.508336624674;4697.13103075932;4702.130105930414;4732.929006064912;4758.262469317261;4576.954230457653;4587.72473651582;4681.204195286809;4705.976470117627;4748.6438517111355;4662.813487460531;4718.127146477913;4732.834350797705;4784.569388755029;4798.640101992295;4704.647151463585;4746.620270378361;4750.429948406213;4796.088743138793;4820.39745031871;3615.204654975901;3639.909002274964;3728.8881333560034;3743.737938344344;3791.298609757204;3375.4936759486272;3392.457206846893;3411.0790086676457;3420.8973730788116;3464.133966508373;4299.97850010748;4459.777011149429;4461;4481.663875209372;4501.639868810487;4619.93070103942;4632.97683511587;4717.764111794397;4736.621070314367;4740.691855029412;4412.073464572476;4431.069475410135;4450.866474005785;4479.0370070434365;4495.842645507391;4026.758394496281;4221.113566151143;4221.176870510221;4232.534421213664;4256.170046840836;4824.204006338985;4831.299461578122;4883.389576302962;4906.754662266872;4915.901681966269;4726.550977657117;4728.101660684597;4745.857624271277;4748.09786140646;4763.3807605011125;4791.47293797689;4876.073546026244;4881.121398148367;4914.385701787277;4952.232403977389;4550.499445061107;4569.428821397325;4628.514006029453;4761.833335833229;4786.138495070921;4698.647601429838;4733.5266473352385;4775.594074503706;4777.259524773665;4777.570018698334;4386.71486353386;4632.652551058617;4659.2079346511855;4671.042436300482;4700.976495117503;4459.375687403701;4519.706219095749;4524.5249248828395;4546.863594092182;4637.049404871926;4537.319402089581;4544.772761361853;4554.43069616298;4580.358749774968;4691.061787642417;4531.116432295803;4656.301554766812;4671.322658214608;4710.764461776966;4744.288356746516;4496.77516124186;4498.955010449854;4530.343100250379;4583.908321833478;4633.606143477842 06:03:17 INFO - 2015-11-12 06:03:17,317 DEBUG : BROWSER_OUTPUT: |1;ext.html;463.68701126739455;474.88602735343505;476.7377942131829;479.92561153021285;496.38696210180444;26137.215883523477;26733.465330693398;32619.184520386974;33399.332013359715;33447.498287525705;35503.4674479883;35588.28823423536;35740.285194296164;35760;36401.45397819028;6947.235804061549;7749.690012399497;7921.841563168733;7930.643121059537;8097.676092956274;6884.414824739903;6923.411510021654;9334.906650933506;9444.338896277264;9454.763630909214;9330.253579713606;9368.578413971387;9447.338686291961;9450.14948654621;9525.380850244712;6848.6918088686125;7077.186123595801;8884.378093533454;9278.072192780735;9403.341766076377;6921.757738479179;9092.818143637156;9285.58214880332;9399.859002114974;9406.106419890168;32967.50548741771;33047;33336;33374.666253337644;33441.6655833441;2473.3816545863533;2479.5164942836154;2538.428853507946;2543.160756950202;2840.758535524483;22903.42741431461;23004.079836806675;23105.88447057771;23206.187783427667;23309;2030.7867673894177;2042.458748431667;2054.6917962305624;2078.833693304532;2091.215794077221;235608;235772;237125;239498;239598;48258.758706206245;48385.5161448388;48542.27186592204;48703.5129648699;48961.26558101631;47178.528214717415;48187;49351.50648493469;51225.23162152571;54760;12524.686882828002;12590.559330423392;12707.809382859265;12733.681657958625;12750.55373061957;9620.278479114095;9638.614455421844;9643.807123857483;9692.273079518924;9708.417494950325;15165.165915874511;15229.162396068323;15252.618684532976;15305.311260993281;15409;6682.365175308338;6966.407855332353;6993.125859267591;7005.614691191931;7040.894386584206;704.7885634309687;715.5635062611802;724.760828926453;735.7314580178196;855.4952577979022;23150.65274020891;23336.29991100236;23667.881660591585;23718.644220336708;23739.406514836923;854.5940678177816;893.9642414303355;898.4025622960658;954.6229239450378;963.6723514005272;12144.514219431123;12224.388780560936;12360.629181124581;12383.380830958416;12443.626691199279;258724;263283;263721;264368;267562;45165.774171128935;45170.32244516335;45269.09461810811;45523.54476455193;45910;1127.103952357861;1128.8814674459227;1134.982975255372;1145.8682251541013;1157.473349625935;23029.88485057564;23119;23211.53576928486;23217;23391.298261052194;34203.31593368168;35154.64845351514;38859.2228155441;39867.40198897077;40100.39849402203;209902;211579;215022;215779;215780;22228.555428891654;22978.770212298332;24409.63385549254;24667.629985549873;25087.87456062708;26807.597886031333;33245.667543324256;33858.49212261769;34028.82985585056;34839;26375.868120659274;28259.717402825707;29457.852710737166;29508;30328.241793955327;28013.439731205668;28755.28111797222;29021.274468138465;29192.854035729684;29414.41171176607;27521.31196720098;27576.17271481859;27919.581206282328;27969.44061118807;28406.857965710038;24612.876935615925;26167.214983550522;26197.607035894096;26204.86897565576;26920.192394228205;19877.30429434963;19999;20163.193472260944;20195.495112622302;20959.790402095783 06:03:17 INFO - 2015-11-12 06:03:17,319 DEBUG : BROWSER_OUTPUT: |2;jquery.html;280.82588794947134;281.7886585061204;282.77801925488495;286.25527410433415;286.447156987015;8470.36472264581;8530.957345213264;15102.169380684058;15716.214189290518;15973.041617502944;8380.748577542683;9356.953215233914;9427.95286023569;9960.701178964624;9965.701028969142;3539.82300884956;3676.8529258829612;3700.0749812546865;3703.0557207911943;3753.3619284721663;2661.5076210901047;2709.4581083783223;2796.3288810685494;3629.891103266906;3696.3531382008177;3832.9041773955737;3889.241597888413;3969.3847453644585;3985.4021896715435;4003.619656132663;3946.3685810270217;3949.1311911379453;3957.7427467214684;3979.880603581897;3995.360742281221;3096.1330827368374;3389.3729660012978;3422.281320922609;3446.7931924084637;3454.9481757773656;10729.624463143831;10893.782124357547;10935.234533582652;10952.34285942846;11040.668779936615;1512.6142833577367;1540.468538354266;1557.4938145102888;1598.4085888221316;1651.4632744358012;7936.436817659127;7993;8100.554469504175;8129.634166462464;8159.306458950996;1296.714722760991;1298.1951190262002;1303.3352989975085;1304.7064410507655;1323.3846261488359;46949.530504694856;47446.5255347449;47554;47629.761851190524;48030.27954580684;5266.526012658803;5356.812511562077;5370.060239458079;5390.245365648812;5418.620696551204;5928.140419639129;6139.10982907476;6155.076738489262;6165.722542485599;6195.752169913243;4357.4988876279;4376.737395756265;4424.247877860771;4425.955740442619;4432.445944256968;4593.977030114828;4615.861524154281;4631.282151266559;4668.043051174501;4672.345871577982;2374.8456350337174;2405.506871091422;2420.9515809683708;2430.6475561043903;2437.2566367258155;860.9569521523899;865.16079402979;869.4261787220404;874.4447275979799;930.4649826349876;297.0657282845482;301.0726960960237;316.5355187473085;337.5476861006263;370.3500356873723;8488.660453581911;8616;8806.075362087016;8837.381383303107;8977.10228977097;310.870988539758;311.68831168831167;326.0820789477613;331.0614408152865;350.0915125249972;4574.428196475441;5101.132807422747;5159.613029022838;5260.158374660036;5302.946970530323;429686;439398;443863;453492;455452;55017.1747423789;57795.71102144462;58267.70866145642;59097.40902591005;59889.40110598925;406.6705968165795;420.7664746065902;422.613308822424;424.24907912994445;432.3752178102612;9159.084091591054;9192.080791920755;9216.262698983932;9402.34183607141;9426.528673566432;28259.858700707187;28262.576061358686;28652.713472865005;28770.712292876804;29682.10953671393;35752.106197345274;36090.27819443649;37469.62530374771;40061.799691002525;40671.983200420225;4851.223804191312;5058.140116180185;5166.3800343958965;5202.609804264771;5218.26944227816;9356.859647105162;9610.231181505602;9708.320417570701;9877.357971732103;9938.850917236392;7138.750143745152;7320.9267907320245;8247.381446391424;8441.535715535705;8455.619497122521;6701.832454188684;7803.453758237096;7976.84046319082;8270.669173233004;8320.16798320163;8631.91368086311;8632.352573556882;8660.133986601542;8663.48019118855;8787.121287871161;5146.481787872512;5166.638335316492;5249.396319423316;5272.130098533852;5307.071262528964;7928.088269849041;8091.716789912325;8233.46482478637;8573.485590864568;8822.955885220534 06:03:17 INFO - 2015-11-12 06:03:17,322 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1033.6795593366053;1432.197969137283;1504.217806740495;1507.3593722667867;1507.879369650428;6088.26940767108;6315.621062736233;6404.775832845851;6649.700763465644;6799.252082270947;6553.50848686348;6572.375624315694;6579.967100164505;6609.867802643944;6721.3278672132765;1719.8968061916262;1732;1746.083306264215;1764.8146944570829;1767.4874286456911;1847.7875044369869;1855.4619160443456;1855.8979256140906;1871.9719204211947;1893.422506135628;1817.8091300413464;1817.990910045448;1828.4423250908467;1845.2526726675717;1852.0739630184908;1780.172219917738;1800.3788692900994;1810.2396993262862;1819.6633622779827;1841.5027942455463;1716.064744714134;1742.35532852844;1749.9825001749946;1752.19399076425;1760.0407777761152;5702.65784052954;6338.651374174418;6489.870202595969;6516.902246466307;6572.07990881277;3530.435130379127;3592.46113083037;3607.6753092221825;3786.962130378716;3926.960730392688;2312.3987763181526;2323.4075310795806;2353.7646235376324;2356.0693526057285;2427.2475532584954;736.3189050128609;737.4616529933126;755.0788038592908;762.4853224073784;781.2421950707804;8614;8697.652093916236;8705.129487051308;8714.477131372201;8715.346349023848;3298.4392653249006;3405.9489107663403;3433.0902310887636;3465.480177973274;3482.2513159670793;7645.350145237606;7691;7713.4214933880185;7731.806704832424;7776.222377762291;3943.72393932422;3953.9604603954167;3962.346212874901;4030.7984600769846;4031.75809451428;3586.2468881534646;3601;3606.4229723244157;3621.6740493355724;3623.58328792187;2774.9583756243674;2835.631367922198;2841.6732075811133;2859.6568411790304;2903.767698584108;905.6830109461636;906.2523418180028;911.6353458616474;918.0773322810533;919.1406035356963;893.6425429827991;911.5123408976166;929.363386080537;931.9627214911328;1138.9430528473542;6047.244094488189;6071.362506936796;6097.481714054266;6107.236595425572;6112.572119951649;338.87122893300386;350.8807005618102;359.7212160575575;361.81366596202975;1007.5466040281902;4727.125481785881;4926.433460152057;4942.20924652054;4946.653734238641;4982.825601104017;7126.144862616416;7324.487285889936;7336.523125996793;7459.962700186465;7827.6477558510005;7563.432742544332;7633.885491717629;7639;7716.575588342583;7782.961085194538;6084.421979911901;6122.571420000646;6142.78500252489;6205.410486003822;6224.62652240867;6080.422359875804;6083.452489275986;6114.6942652868065;6134.38656134383;6195.504359651127;6733.562318449285;6844.281350458329;6879.759208427681;6941.93058069433;7090.220075791555;6893.517453778388;7032.929670703432;7188.820279492846;7241.637918104179;7242.3843973262865;5452.509274165344;5499.395066542597;5511.696856672921;5543.584231182758;5562.22128901946;5862.267216597926;5942.524598032233;6158.137860699595;6357.078223657636;6363.61818290904;5809.099589563624;5841.970790146022;5860.706964651665;5868.413158684098;5916;5623.8594035149445;5764.193012978102;5766.192733017465;5805.10020946754;5840.240768700041;5893.174955506318;5900.409959004065;5912.201852749824;5929.52563794904;5972.940270597413;5316.494932981361;5332.5733941283825;5336.839894803162;5367.490088441592;5462.863428414322;5442.891142177214;5474.397816240131;5477.4796394342475;5508.283923089973;5536.806211782568 06:03:17 INFO - 2015-11-12 06:03:17,323 DEBUG : BROWSER_OUTPUT: |4;prototype.html;251.91938579654513;260.7067049569236;261.53969014534414;264.3470627549952;265.27711984841307;4938.2098864181735;4958.727270000149;4987.501249875011;5018.673786203894;5079.822206222788;4806.5193480651915;4839.8790030249265;4895.31465594817;4930.679505832119;4948.975255123728;3846.499955005845;3851.05649115967;3868.303705333039;3885.592012838654;3891.6497515223623;3895.668868146211;3923.8234279457492;3932.6853851691794;3942.7240093193486;3954.604539546037;3858;3877.495925529677;3891.1633998690277;3899.551551571563;3948.8420463181437;3860.305145073886;3885.592012838654;3899.707521935866;3913.5303763548272;3965.841366345357;3271.5910511186103;3311.536384906115;3320.6181289151814;3325.5011748237716;3351.262722201112;4888;4897.60819134472;4902.730349830758;4917;5000.574951129159;4241.703080784347;4266.338717498793;4286.164197981395;4309.4397728295435;4324.740515569076;5204.141316682742;5217.869553261199;5233.790648374099;5260.447652996457;5269.025230332362;3291.2101095736853;3329.583802024747;3342.29811739535;3430.365382404238;3503.24680193757;5365.651232669864;5423.186522021729;5430.321209848769;5486.807961721321;5529.861753456155;3438.5014172944784;3543.255916257615;3546.7517273790586;3581.1047238190454;3606.8737594184076;3419.794812311269;3427.143214196451;3439.673231043047;3493.7729047612333;3623.1847834237087;4104.527979282361;4153.169366126726;4162.125953549788;4171.791410429466;4183.895402614898;5149.124648809711;5220.92168617471;5220.92168617471;5223.425423203445;5284.4187139414635;1287.8261434706194;1303.1985329022773;1306.7843805772131;1307.7123032932739;1317.8748018938186;819.6393586821779;844.5650489997656;845.6955496021427;852.7143406958738;867.6702852915852;4981.701097934136;4982.153033984231;4985.4266759323145;5028.069807085701;5049.116404629175;5405.297311349499;5415.729213539307;5442.700651464128;5483.067878460672;5501.944980550224;4956.479569645207;4970.627202959792;4975.378077740283;4976;4986.227134794112;2920.8101473404163;2946;3000.6699263081046;3015.8341291228753;3044.2845931206148;5603.842520629505;5617.887642247132;5670.432956704297;5728.255326807488;5759.510441612426;5539.390667026624;5560.5551555876245;5578.972105139448;5602.579806514527;5686.687232202268;5591.356993945748;5600.4959553640365;5623.522000629992;5637.098064309691;5736.110902810071;5257.631965762513;5369.436209197978;5430.51125398716;5454.809081682122;5477.1510415885605;5311.229871668509;5332.626716129989;5332.706701131475;5399.4600539945695;5408.242846001642;5629.4652008059165;5640.492355688008;5679.34687510925;5693.459121383462;5720.914186287126;3593.802340871277;3607.2244467439627;3608.657177568127;3618.656227658368;3621.9456708148873;5223.242629818579;5269.046691935704;5327.760250788801;5441.347038355423;5533.363663178786;5227.320448341843;5281.128613778684;5284.550813180923;5297.655652382583;5411.107167317348;5318.282031925641;5319.281896943863;5338.3060202173465;5343.599230057684;5349.090654588651;5140.537351638221;5158.793648254028;5203.713795741119;5209;5258.50044245796;5186.507281808223;5246.711430871339;5269.525742683177;5374.892502149857;5405.432429594836;5276.630635855453;5282.207668849704;5314.97342513285;5348.983693098299;5368.194770784257 06:03:17 INFO - 2015-11-12 06:03:17,325 DEBUG : BROWSER_OUTPUT: |5;yui.html;626.8182227154125;630.9337519560446;634.6763150793097;636.1157990393357;643.3727116061839;10682.946585267062;10890.292131011478;11324.547018119276;11762.411879406038;11965.76068478631;9776.755581110458;11784.705382365446;12043.75912481752;12109.697257568565;12190.207636503643;573.2061095382904;587.8354060862965;717.7559629725893;739.7004213293625;740.5371642723298;695.9478039147059;719.8164468060637;722.9240929702358;739.589527812064;740.8592367450194;758.2682711183706;760.4106817216674;765.7243392378739;766.7853001159656;772.5364781131333;747.439420434674;752.8833030880222;753.0473950452682;758.0410780362845;763.480833033537;553.3111276460792;555.3419198250086;557.5316733943466;560.2660514725723;561.3628531616645;11262.493187806487;11335.979761821392;11389.259698119597;11397.202195846294;11400.25898316615;7241.493095483318;7341.1557670868;7432.516886402421;7908.209179082103;7920.920790792134;6685.39831415175;7087.92912070883;7168.319009694071;7607.885881711779;7649.349805266559;2370.810335173182;2385.33210701004;2476.4304210031614;2479.330580743207;2586.1594981631047;38176.236475270336;38375.232495349934;38396.80801596002;38889.027774305585;38962;5585;5625.578081643893;5709.257796486513;5716.114002329646;5814.825555233349;9853.458059806779;9863.40819550815;9873.259505537113;9950.203983681433;10012.349197302152;5109.3613298337705;5181.4041385240425;5391.056565101092;5983.700814959235;6186.845328866814;3126.155937896755;3198.3923054620013;3253.4957081652383;3291.2182960014347;3318.4192766265805;2508.535920854648;2553.272317389535;2554.514642217973;2563.3207200091992;2587.9648140743852;347.7722092029725;354.601073791984;355.3940531394019;358.9982050089733;360.0961586418109;382.31183869035624;421.6879509163197;448.2424702253182;499.7739590940543;534.4014703531991;6170.254236864642;6513.609183449008;6656.467482601381;6771.966140169267;6786.185657721105;374.6497025281371;477.1459088232026;492.8964917367393;494.7699319816231;537.5081800152816;2900.1734505665786;2959.5116805726816;3093.597832281789;3195.1498444374474;3258.3809076275434;48100.75949620229;48412;49126;49225;49279.014419711406;39976.400353994715;40460.1907961845;40734.796326018775;41051;42279.365809512885;35888.461673074926;36778.712745053796;36816.63183368132;37133.442998354505;37528.62471375306;6643.501737369813;6814.557053791487;7050.5769653820935;7094.680739366844;7154.35610795031;28482.715172848006;29412.558811617415;29639.25901852471;29852.70147298499;30749.23126921845;38495;38844.223115538094;39155;43137.78431107824;43887.34168987404;8781.824363512822;8950.373473856767;9300.209482193819;9335.299852510952;9399.530023498934;9240.306976976619;9401.670941517013;9486.77683890448;9749.80500389974;9901.752456188653;8905.243054340453;9022.774430639287;9195.954020230123;9384.57769400365;9575.904240957501;9052.954735226282;9075;9118.680846170351;9155.633774648939;9173.44959302444;8677.652893884426;8761.605727742139;8824.205821476098;8831.69089081879;9170.220531254918;7493.250674932463;7646.617669116411;7749.883751743616;7774.92225077742;7857.174996625272;7248.60132692707;7515.511491753018;7802;7912.0901096374655;8170.714025009096 06:03:17 INFO - 2015-11-12 06:03:17,325 DEBUG : BROWSER_OUTPUT: __end_tp_report 06:03:17 INFO - 2015-11-12 06:03:17,325 DEBUG : BROWSER_OUTPUT: __start_cc_report 06:03:17 INFO - 2015-11-12 06:03:17,325 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1051 06:03:17 INFO - 2015-11-12 06:03:17,325 DEBUG : BROWSER_OUTPUT: __end_cc_report 06:03:17 INFO - 2015-11-12 06:03:17,325 DEBUG : BROWSER_OUTPUT: __startTimestamp1447336997310__endTimestamp 06:03:17 INFO - 2015-11-12 06:03:17,326 DEBUG : BROWSER_OUTPUT: 06:03:17 INFO - 2015-11-12 06:03:17,326 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 06:03:17 INFO - 2015-11-12 06:03:17,326 DEBUG : BROWSER_OUTPUT: Number of tests: 6 06:03:17 INFO - 2015-11-12 06:03:17,326 DEBUG : BROWSER_OUTPUT: 06:03:17 INFO - 2015-11-12 06:03:17,326 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4430.89 Median:4531.12 stddev:456.31 (10.1%) stddev-sans-first:433.93 06:03:17 INFO - 2015-11-12 06:03:17,328 DEBUG : BROWSER_OUTPUT: Values: 2577.8 2648.0 2657.3 2672.4 2674.0 4334.5 4384.5 4449.8 4469.1 4501.4 4289.9 4334.4 4364.9 4365.9 4488.6 3956.7 4053.2 4163.2 4222.5 4293.8 4194.2 4250.4 4299.0 4321.5 4323.2 4046.2 4094.1 4097.0 4176.8 4229.0 4171.3 4227.7 4255.1 4259.4 4284.0 4194.3 4195.8 4197.6 4204.0 4266.1 4218.6 4346.5 4420.7 4425.5 4471.5 4664.3 4676.3 4718.9 4768.1 4773.0 4754.5 4804.9 4819.4 4868.2 4880.5 4315.0 4315.9 4416.0 4456.1 4466.7 4761.3 4842.4 4844.5 4879.9 4897.9 4682.5 4697.1 4702.1 4732.9 4758.3 4577.0 4587.7 4681.2 4706.0 4748.6 4662.8 4718.1 4732.8 4784.6 4798.6 4704.6 4746.6 4750.4 4796.1 4820.4 3615.2 3639.9 3728.9 3743.7 3791.3 3375.5 3392.5 3411.1 3420.9 3464.1 4300.0 4459.8 4461.0 4481.7 4501.6 4619.9 4633.0 4717.8 4736.6 4740.7 4412.1 4431.1 4450.9 4479.0 4495.8 4026.8 4221.1 4221.2 4232.5 4256.2 4824.2 4831.3 4883.4 4906.8 4915.9 4726.6 4728.1 4745.9 4748.1 4763.4 4791.5 4876.1 4881.1 4914.4 4952.2 4550.5 4569.4 4628.5 4761.8 4786.1 4698.6 4733.5 4775.6 4777.3 4777.6 4386.7 4632.7 4659.2 4671.0 4701.0 4459.4 4519.7 4524.5 4546.9 4637.0 4537.3 4544.8 4554.4 4580.4 4691.1 4531.1 4656.3 4671.3 4710.8 4744.3 4496.8 4499.0 4530.3 4583.9 4633.6 06:03:17 INFO - 2015-11-12 06:03:17,328 DEBUG : BROWSER_OUTPUT: 06:03:17 INFO - 2015-11-12 06:03:17,328 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:37817.01 Median:29482.93 stddev:62441.52 (211.8%) stddev-sans-first:62553.70 06:03:17 INFO - 2015-11-12 06:03:17,329 DEBUG : BROWSER_OUTPUT: Values: 463.7 474.9 476.7 479.9 496.4 26137.2 26733.5 32619.2 33399.3 33447.5 35503.5 35588.3 35740.3 35760.0 36401.5 6947.2 7749.7 7921.8 7930.6 8097.7 6884.4 6923.4 9334.9 9444.3 9454.8 9330.3 9368.6 9447.3 9450.1 9525.4 6848.7 7077.2 8884.4 9278.1 9403.3 6921.8 9092.8 9285.6 9399.9 9406.1 32967.5 33047.0 33336.0 33374.7 33441.7 2473.4 2479.5 2538.4 2543.2 2840.8 22903.4 23004.1 23105.9 23206.2 23309.0 2030.8 2042.5 2054.7 2078.8 2091.2 235608.0 235772.0 237125.0 239498.0 239598.0 48258.8 48385.5 48542.3 48703.5 48961.3 47178.5 48187.0 49351.5 51225.2 54760.0 12524.7 12590.6 12707.8 12733.7 12750.6 9620.3 9638.6 9643.8 9692.3 9708.4 15165.2 15229.2 15252.6 15305.3 15409.0 6682.4 6966.4 6993.1 7005.6 7040.9 704.8 715.6 724.8 735.7 855.5 23150.7 23336.3 23667.9 23718.6 23739.4 854.6 894.0 898.4 954.6 963.7 12144.5 12224.4 12360.6 12383.4 12443.6 258724.0 263283.0 263721.0 264368.0 267562.0 45165.8 45170.3 45269.1 45523.5 45910.0 1127.1 1128.9 1135.0 1145.9 1157.5 23029.9 23119.0 23211.5 23217.0 23391.3 34203.3 35154.6 38859.2 39867.4 40100.4 209902.0 211579.0 215022.0 215779.0 215780.0 22228.6 22978.8 24409.6 24667.6 25087.9 26807.6 33245.7 33858.5 34028.8 34839.0 26375.9 28259.7 29457.9 29508.0 30328.2 28013.4 28755.3 29021.3 29192.9 29414.4 27521.3 27576.2 27919.6 27969.4 28406.9 24612.9 26167.2 26197.6 26204.9 26920.2 19877.3 19999.0 20163.2 20195.5 20959.8 06:03:17 INFO - 2015-11-12 06:03:17,330 DEBUG : BROWSER_OUTPUT: 06:03:17 INFO - 2015-11-12 06:03:17,330 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:21659.74 Median:4623.57 stddev:72814.63 (1574.9%) stddev-sans-first:73001.19 06:03:17 INFO - 2015-11-12 06:03:17,331 DEBUG : BROWSER_OUTPUT: Values: 280.8 281.8 282.8 286.3 286.4 8470.4 8531.0 15102.2 15716.2 15973.0 8380.7 9357.0 9428.0 9960.7 9965.7 3539.8 3676.9 3700.1 3703.1 3753.4 2661.5 2709.5 2796.3 3629.9 3696.4 3832.9 3889.2 3969.4 3985.4 4003.6 3946.4 3949.1 3957.7 3979.9 3995.4 3096.1 3389.4 3422.3 3446.8 3454.9 10729.6 10893.8 10935.2 10952.3 11040.7 1512.6 1540.5 1557.5 1598.4 1651.5 7936.4 7993.0 8100.6 8129.6 8159.3 1296.7 1298.2 1303.3 1304.7 1323.4 46949.5 47446.5 47554.0 47629.8 48030.3 5266.5 5356.8 5370.1 5390.2 5418.6 5928.1 6139.1 6155.1 6165.7 6195.8 4357.5 4376.7 4424.2 4426.0 4432.4 4594.0 4615.9 4631.3 4668.0 4672.3 2374.8 2405.5 2421.0 2430.6 2437.3 861.0 865.2 869.4 874.4 930.5 297.1 301.1 316.5 337.5 370.4 8488.7 8616.0 8806.1 8837.4 8977.1 310.9 311.7 326.1 331.1 350.1 4574.4 5101.1 5159.6 5260.2 5302.9 429686.0 439398.0 443863.0 453492.0 455452.0 55017.2 57795.7 58267.7 59097.4 59889.4 406.7 420.8 422.6 424.2 432.4 9159.1 9192.1 9216.3 9402.3 9426.5 28259.9 28262.6 28652.7 28770.7 29682.1 35752.1 36090.3 37469.6 40061.8 40672.0 4851.2 5058.1 5166.4 5202.6 5218.3 9356.9 9610.2 9708.3 9877.4 9938.9 7138.8 7320.9 8247.4 8441.5 8455.6 6701.8 7803.5 7976.8 8270.7 8320.2 8631.9 8632.4 8660.1 8663.5 8787.1 5146.5 5166.6 5249.4 5272.1 5307.1 7928.1 8091.7 8233.5 8573.5 8823.0 06:03:17 INFO - 2015-11-12 06:03:17,332 DEBUG : BROWSER_OUTPUT: 06:03:17 INFO - 2015-11-12 06:03:17,332 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4488.85 Median:5807.10 stddev:2374.75 (40.9%) stddev-sans-first:2367.20 06:03:17 INFO - 2015-11-12 06:03:17,332 DEBUG : BROWSER_OUTPUT: Values: 1033.7 1432.2 1504.2 1507.4 1507.9 6088.3 6315.6 6404.8 6649.7 6799.3 6553.5 6572.4 6580.0 6609.9 6721.3 1719.9 1732.0 1746.1 1764.8 1767.5 1847.8 1855.5 1855.9 1872.0 1893.4 1817.8 1818.0 1828.4 1845.3 1852.1 1780.2 1800.4 1810.2 1819.7 1841.5 1716.1 1742.4 1750.0 1752.2 1760.0 5702.7 6338.7 6489.9 6516.9 6572.1 3530.4 3592.5 3607.7 3787.0 3927.0 2312.4 2323.4 2353.8 2356.1 2427.2 736.3 737.5 755.1 762.5 781.2 8614.0 8697.7 8705.1 8714.5 8715.3 3298.4 3405.9 3433.1 3465.5 3482.3 7645.4 7691.0 7713.4 7731.8 7776.2 3943.7 3954.0 3962.3 4030.8 4031.8 3586.2 3601.0 3606.4 3621.7 3623.6 2775.0 2835.6 2841.7 2859.7 2903.8 905.7 906.3 911.6 918.1 919.1 893.6 911.5 929.4 932.0 1138.9 6047.2 6071.4 6097.5 6107.2 6112.6 338.9 350.9 359.7 361.8 1007.5 4727.1 4926.4 4942.2 4946.7 4982.8 7126.1 7324.5 7336.5 7460.0 7827.6 7563.4 7633.9 7639.0 7716.6 7783.0 6084.4 6122.6 6142.8 6205.4 6224.6 6080.4 6083.5 6114.7 6134.4 6195.5 6733.6 6844.3 6879.8 6941.9 7090.2 6893.5 7032.9 7188.8 7241.6 7242.4 5452.5 5499.4 5511.7 5543.6 5562.2 5862.3 5942.5 6158.1 6357.1 6363.6 5809.1 5842.0 5860.7 5868.4 5916.0 5623.9 5764.2 5766.2 5805.1 5840.2 5893.2 5900.4 5912.2 5929.5 5972.9 5316.5 5332.6 5336.8 5367.5 5462.9 5442.9 5474.4 5477.5 5508.3 5536.8 06:03:17 INFO - 2015-11-12 06:03:17,332 DEBUG : BROWSER_OUTPUT: 06:03:17 INFO - 2015-11-12 06:03:17,334 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4389.91 Median:5009.62 stddev:1347.91 (26.9%) stddev-sans-first:1315.42 06:03:17 INFO - 2015-11-12 06:03:17,334 DEBUG : BROWSER_OUTPUT: Values: 251.9 260.7 261.5 264.3 265.3 4938.2 4958.7 4987.5 5018.7 5079.8 4806.5 4839.9 4895.3 4930.7 4949.0 3846.5 3851.1 3868.3 3885.6 3891.6 3895.7 3923.8 3932.7 3942.7 3954.6 3858.0 3877.5 3891.2 3899.6 3948.8 3860.3 3885.6 3899.7 3913.5 3965.8 3271.6 3311.5 3320.6 3325.5 3351.3 4888.0 4897.6 4902.7 4917.0 5000.6 4241.7 4266.3 4286.2 4309.4 4324.7 5204.1 5217.9 5233.8 5260.4 5269.0 3291.2 3329.6 3342.3 3430.4 3503.2 5365.7 5423.2 5430.3 5486.8 5529.9 3438.5 3543.3 3546.8 3581.1 3606.9 3419.8 3427.1 3439.7 3493.8 3623.2 4104.5 4153.2 4162.1 4171.8 4183.9 5149.1 5220.9 5220.9 5223.4 5284.4 1287.8 1303.2 1306.8 1307.7 1317.9 819.6 844.6 845.7 852.7 867.7 4981.7 4982.2 4985.4 5028.1 5049.1 5405.3 5415.7 5442.7 5483.1 5501.9 4956.5 4970.6 4975.4 4976.0 4986.2 2920.8 2946.0 3000.7 3015.8 3044.3 5603.8 5617.9 5670.4 5728.3 5759.5 5539.4 5560.6 5579.0 5602.6 5686.7 5591.4 5600.5 5623.5 5637.1 5736.1 5257.6 5369.4 5430.5 5454.8 5477.2 5311.2 5332.6 5332.7 5399.5 5408.2 5629.5 5640.5 5679.3 5693.5 5720.9 3593.8 3607.2 3608.7 3618.7 3621.9 5223.2 5269.0 5327.8 5441.3 5533.4 5227.3 5281.1 5284.6 5297.7 5411.1 5318.3 5319.3 5338.3 5343.6 5349.1 5140.5 5158.8 5203.7 5209.0 5258.5 5186.5 5246.7 5269.5 5374.9 5405.4 5276.6 5282.2 5315.0 5349.0 5368.2 06:03:17 INFO - 2015-11-12 06:03:17,334 DEBUG : BROWSER_OUTPUT: 06:03:17 INFO - 2015-11-12 06:03:17,334 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11035.54 Median:5712.69 stddev:13360.74 (233.9%) stddev-sans-first:13375.36 06:03:17 INFO - 2015-11-12 06:03:17,335 DEBUG : BROWSER_OUTPUT: Values: 626.8 630.9 634.7 636.1 643.4 10682.9 10890.3 11324.5 11762.4 11965.8 9776.8 11784.7 12043.8 12109.7 12190.2 573.2 587.8 717.8 739.7 740.5 695.9 719.8 722.9 739.6 740.9 758.3 760.4 765.7 766.8 772.5 747.4 752.9 753.0 758.0 763.5 553.3 555.3 557.5 560.3 561.4 11262.5 11336.0 11389.3 11397.2 11400.3 7241.5 7341.2 7432.5 7908.2 7920.9 6685.4 7087.9 7168.3 7607.9 7649.3 2370.8 2385.3 2476.4 2479.3 2586.2 38176.2 38375.2 38396.8 38889.0 38962.0 5585.0 5625.6 5709.3 5716.1 5814.8 9853.5 9863.4 9873.3 9950.2 10012.3 5109.4 5181.4 5391.1 5983.7 6186.8 3126.2 3198.4 3253.5 3291.2 3318.4 2508.5 2553.3 2554.5 2563.3 2588.0 347.8 354.6 355.4 359.0 360.1 382.3 421.7 448.2 499.8 534.4 6170.3 6513.6 6656.5 6772.0 6786.2 374.6 477.1 492.9 494.8 537.5 2900.2 2959.5 3093.6 3195.1 3258.4 48100.8 48412.0 49126.0 49225.0 49279.0 39976.4 40460.2 40734.8 41051.0 42279.4 35888.5 36778.7 36816.6 37133.4 37528.6 6643.5 6814.6 7050.6 7094.7 7154.4 28482.7 29412.6 29639.3 29852.7 30749.2 38495.0 38844.2 39155.0 43137.8 43887.3 8781.8 8950.4 9300.2 9335.3 9399.5 9240.3 9401.7 9486.8 9749.8 9901.8 8905.2 9022.8 9196.0 9384.6 9575.9 9053.0 9075.0 9118.7 9155.6 9173.4 8677.7 8761.6 8824.2 8831.7 9170.2 7493.3 7646.6 7749.9 7774.9 7857.2 7248.6 7515.5 7802.0 7912.1 8170.7 06:03:17 INFO - 2015-11-12 06:03:17,335 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 06:03:17 INFO - 2015-11-12 06:03:17,336 DEBUG : BROWSER_OUTPUT: 06:03:18 INFO - 2015-11-12 06:03:18,036 INFO : Browser exited with error code: 0 06:03:18 INFO - 2015-11-12 06:03:18,070 INFO : Completed test dromaeo_css (00:18:36) 06:03:18 INFO - 2015-11-12 06:03:18,070 INFO : Starting test kraken 06:03:18 INFO - 2015-11-12 06:03:18,070 DEBUG : operating with platform_type : mac_ 06:03:18 INFO - 2015-11-12 06:03:18,070 INFO : Initialising browser for kraken test... 06:03:18 INFO - 2015-11-12 06:03:18,086 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/tmp2pmpU5/profile http://localhost:51237/getInfo.html 06:03:20 INFO - 2015-11-12 06:03:20,812 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 06:03:20 INFO - 2015-11-12 06:03:20,814 DEBUG : BROWSER_OUTPUT: colorDepth:24 06:03:20 INFO - 2015-11-12 06:03:20,814 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 06:03:20 INFO - 2015-11-12 06:03:20,814 DEBUG : BROWSER_OUTPUT: __metrics 06:03:20 INFO - 2015-11-12 06:03:20,835 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:03:21 INFO - 2015-11-12 06:03:21,592 INFO : Browser initialized. 06:03:21 INFO - 2015-11-12 06:03:21,592 INFO : Running cycle 1/1 for kraken test... 06:03:21 INFO - 2015-11-12 06:03:21,592 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/tmp2pmpU5/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 06:03:33 INFO - 2015-11-12 06:03:33,869 DEBUG : BROWSER_OUTPUT: RSS: Main: 228655104 06:03:33 INFO - 2015-11-12 06:03:33,869 DEBUG : BROWSER_OUTPUT: 06:03:36 INFO - 2015-11-12 06:03:36,767 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51237/tests/kraken/driver.html?testName=audio-beat-detection) 06:03:37 INFO - 2015-11-12 06:03:37,360 DEBUG : BROWSER_OUTPUT: RSS: Main: 284950528 06:03:37 INFO - 2015-11-12 06:03:37,360 DEBUG : BROWSER_OUTPUT: 06:03:40 INFO - 2015-11-12 06:03:40,419 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51237/tests/kraken/driver.html?testName=audio-dft) 06:03:41 INFO - 2015-11-12 06:03:41,010 DEBUG : BROWSER_OUTPUT: RSS: Main: 297381888 06:03:41 INFO - 2015-11-12 06:03:41,011 DEBUG : BROWSER_OUTPUT: 06:03:44 INFO - 2015-11-12 06:03:44,420 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51237/tests/kraken/driver.html?testName=audio-fft) 06:03:45 INFO - 2015-11-12 06:03:45,004 DEBUG : BROWSER_OUTPUT: RSS: Main: 281378816 06:03:45 INFO - 2015-11-12 06:03:45,004 DEBUG : BROWSER_OUTPUT: 06:03:47 INFO - 2015-11-12 06:03:47,252 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51237/tests/kraken/driver.html?testName=audio-oscillator) 06:03:47 INFO - 2015-11-12 06:03:47,848 DEBUG : BROWSER_OUTPUT: RSS: Main: 283316224 06:03:47 INFO - 2015-11-12 06:03:47,848 DEBUG : BROWSER_OUTPUT: 06:03:50 INFO - 2015-11-12 06:03:50,337 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51237/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:03:50 INFO - 2015-11-12 06:03:50,917 DEBUG : BROWSER_OUTPUT: RSS: Main: 283480064 06:03:50 INFO - 2015-11-12 06:03:50,917 DEBUG : BROWSER_OUTPUT: 06:03:54 INFO - 2015-11-12 06:03:54,447 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51237/tests/kraken/driver.html?testName=imaging-darkroom) 06:03:55 INFO - 2015-11-12 06:03:55,032 DEBUG : BROWSER_OUTPUT: RSS: Main: 277729280 06:03:55 INFO - 2015-11-12 06:03:55,032 DEBUG : BROWSER_OUTPUT: 06:03:58 INFO - 2015-11-12 06:03:58,653 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51237/tests/kraken/driver.html?testName=imaging-desaturate) 06:03:59 INFO - 2015-11-12 06:03:59,250 DEBUG : BROWSER_OUTPUT: RSS: Main: 280178688 06:03:59 INFO - 2015-11-12 06:03:59,250 DEBUG : BROWSER_OUTPUT: 06:04:02 INFO - 2015-11-12 06:04:02,577 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51237/tests/kraken/driver.html?testName=json-parse-financial) 06:04:03 INFO - 2015-11-12 06:04:03,161 DEBUG : BROWSER_OUTPUT: RSS: Main: 280346624 06:04:03 INFO - 2015-11-12 06:04:03,161 DEBUG : BROWSER_OUTPUT: 06:04:04 INFO - 2015-11-12 06:04:04,902 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51237/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:04:05 INFO - 2015-11-12 06:04:05,478 DEBUG : BROWSER_OUTPUT: RSS: Main: 318590976 06:04:05 INFO - 2015-11-12 06:04:05,478 DEBUG : BROWSER_OUTPUT: 06:04:07 INFO - 2015-11-12 06:04:07,523 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51237/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:04:08 INFO - 2015-11-12 06:04:08,139 DEBUG : BROWSER_OUTPUT: RSS: Main: 318226432 06:04:08 INFO - 2015-11-12 06:04:08,140 DEBUG : BROWSER_OUTPUT: 06:04:10 INFO - 2015-11-12 06:04:10,530 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51237/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:04:11 INFO - 2015-11-12 06:04:11,116 DEBUG : BROWSER_OUTPUT: RSS: Main: 326045696 06:04:11 INFO - 2015-11-12 06:04:11,117 DEBUG : BROWSER_OUTPUT: 06:04:14 INFO - 2015-11-12 06:04:14,114 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51237/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:04:14 INFO - 2015-11-12 06:04:14,718 DEBUG : BROWSER_OUTPUT: RSS: Main: 326295552 06:04:14 INFO - 2015-11-12 06:04:14,718 DEBUG : BROWSER_OUTPUT: 06:04:17 INFO - 2015-11-12 06:04:17,779 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51237/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:04:18 INFO - 2015-11-12 06:04:18,362 DEBUG : BROWSER_OUTPUT: RSS: Main: 327479296 06:04:18 INFO - 2015-11-12 06:04:18,363 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,341 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51237/tests/kraken/driver.html?testName=ai-astar) 06:04:20 INFO - 2015-11-12 06:04:20,590 DEBUG : BROWSER_OUTPUT: RSS: Main: 386437120 06:04:20 INFO - 2015-11-12 06:04:20,590 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,590 DEBUG : BROWSER_OUTPUT: __start_tp_report 06:04:20 INFO - 2015-11-12 06:04:20,590 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 06:04:20 INFO - 2015-11-12 06:04:20,590 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 06:04:20 INFO - 2015-11-12 06:04:20,590 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 06:04:20 INFO - 2015-11-12 06:04:20,590 DEBUG : BROWSER_OUTPUT: |0;ai-astar;124;131;124;131;129;126;115;135;121;132 06:04:20 INFO - 2015-11-12 06:04:20,590 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;190;159;185;194;155;181;180;153;198;155 06:04:20 INFO - 2015-11-12 06:04:20,590 DEBUG : BROWSER_OUTPUT: |2;audio-dft;187;196;196;195;195;190;192;198;197;197 06:04:20 INFO - 2015-11-12 06:04:20,591 DEBUG : BROWSER_OUTPUT: |3;audio-fft;88;93;103;145;80;85;83;85;132;80 06:04:20 INFO - 2015-11-12 06:04:20,591 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;115;117;165;109;109;110;156;108;106;150 06:04:20 INFO - 2015-11-12 06:04:20,591 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;142;148;142;142;149;140;141;135;142;148 06:04:20 INFO - 2015-11-12 06:04:20,591 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;149;155;154;154;147;154;154;152;147;154 06:04:20 INFO - 2015-11-12 06:04:20,591 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;121;124;124;123;124;124;124;123;125;125 06:04:20 INFO - 2015-11-12 06:04:20,591 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;67;69;67;69;69;72;75;81;73;72 06:04:20 INFO - 2015-11-12 06:04:20,591 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;70;86;79;80;80;79;83;83;84;84 06:04:20 INFO - 2015-11-12 06:04:20,591 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;97;101;107;105;107;107;107;108;106;107 06:04:20 INFO - 2015-11-12 06:04:20,592 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;151;165;152;153;165;167;155;158;162;162 06:04:20 INFO - 2015-11-12 06:04:20,592 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;172;177;192;192;196;171;186;190;195;192 06:04:20 INFO - 2015-11-12 06:04:20,592 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;81;87;90;88;88;88;88;88;86;89 06:04:20 INFO - 2015-11-12 06:04:20,592 DEBUG : BROWSER_OUTPUT: __end_tp_report 06:04:20 INFO - 2015-11-12 06:04:20,592 DEBUG : BROWSER_OUTPUT: __start_cc_report 06:04:20 INFO - 2015-11-12 06:04:20,592 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,974 06:04:20 INFO - 2015-11-12 06:04:20,592 DEBUG : BROWSER_OUTPUT: __end_cc_report 06:04:20 INFO - 2015-11-12 06:04:20,592 DEBUG : BROWSER_OUTPUT: __startTimestamp1447337060589__endTimestamp 06:04:20 INFO - 2015-11-12 06:04:20,593 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,594 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 06:04:20 INFO - 2015-11-12 06:04:20,594 DEBUG : BROWSER_OUTPUT: Number of tests: 14 06:04:20 INFO - 2015-11-12 06:04:20,594 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,594 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:126.80 Median:130.00 stddev:6.00 (4.6%) stddev-sans-first:6.27 06:04:20 INFO - 2015-11-12 06:04:20,595 DEBUG : BROWSER_OUTPUT: Values: 124.0 131.0 124.0 131.0 129.0 126.0 115.0 135.0 121.0 132.0 06:04:20 INFO - 2015-11-12 06:04:20,595 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,595 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:175.00 Median:183.00 stddev:17.69 (9.7%) stddev-sans-first:17.91 06:04:20 INFO - 2015-11-12 06:04:20,595 DEBUG : BROWSER_OUTPUT: Values: 190.0 159.0 185.0 194.0 155.0 181.0 180.0 153.0 198.0 155.0 06:04:20 INFO - 2015-11-12 06:04:20,595 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,595 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:194.30 Median:196.00 stddev:3.53 (1.8%) stddev-sans-first:2.57 06:04:20 INFO - 2015-11-12 06:04:20,595 DEBUG : BROWSER_OUTPUT: Values: 187.0 196.0 196.0 195.0 195.0 190.0 192.0 198.0 197.0 197.0 06:04:20 INFO - 2015-11-12 06:04:20,595 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,595 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:97.40 Median:84.00 stddev:22.91 (27.3%) stddev-sans-first:24.04 06:04:20 INFO - 2015-11-12 06:04:20,596 DEBUG : BROWSER_OUTPUT: Values: 88.0 93.0 103.0 145.0 80.0 85.0 83.0 85.0 132.0 80.0 06:04:20 INFO - 2015-11-12 06:04:20,596 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,596 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:124.50 Median:116.00 stddev:22.94 (19.8%) stddev-sans-first:24.07 06:04:20 INFO - 2015-11-12 06:04:20,596 DEBUG : BROWSER_OUTPUT: Values: 115.0 117.0 165.0 109.0 109.0 110.0 156.0 108.0 106.0 150.0 06:04:20 INFO - 2015-11-12 06:04:20,596 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,597 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:142.90 Median:142.00 stddev:4.31 (3.0%) stddev-sans-first:4.56 06:04:20 INFO - 2015-11-12 06:04:20,597 DEBUG : BROWSER_OUTPUT: Values: 142.0 148.0 142.0 142.0 149.0 140.0 141.0 135.0 142.0 148.0 06:04:20 INFO - 2015-11-12 06:04:20,597 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,597 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:152.00 Median:154.00 stddev:3.13 (2.0%) stddev-sans-first:3.12 06:04:20 INFO - 2015-11-12 06:04:20,599 DEBUG : BROWSER_OUTPUT: Values: 149.0 155.0 154.0 154.0 147.0 154.0 154.0 152.0 147.0 154.0 06:04:20 INFO - 2015-11-12 06:04:20,599 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,599 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:123.70 Median:124.00 stddev:1.16 (0.9%) stddev-sans-first:0.71 06:04:20 INFO - 2015-11-12 06:04:20,599 DEBUG : BROWSER_OUTPUT: Values: 121.0 124.0 124.0 123.0 124.0 124.0 124.0 123.0 125.0 125.0 06:04:20 INFO - 2015-11-12 06:04:20,599 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,599 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:71.40 Median:72.00 stddev:4.27 (5.9%) stddev-sans-first:4.23 06:04:20 INFO - 2015-11-12 06:04:20,600 DEBUG : BROWSER_OUTPUT: Values: 67.0 69.0 67.0 69.0 69.0 72.0 75.0 81.0 73.0 72.0 06:04:20 INFO - 2015-11-12 06:04:20,600 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,600 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:80.80 Median:83.00 stddev:4.49 (5.4%) stddev-sans-first:2.55 06:04:20 INFO - 2015-11-12 06:04:20,600 DEBUG : BROWSER_OUTPUT: Values: 70.0 86.0 79.0 80.0 80.0 79.0 83.0 83.0 84.0 84.0 06:04:20 INFO - 2015-11-12 06:04:20,600 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,600 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:105.20 Median:107.00 stddev:3.49 (3.3%) stddev-sans-first:2.09 06:04:20 INFO - 2015-11-12 06:04:20,600 DEBUG : BROWSER_OUTPUT: Values: 97.0 101.0 107.0 105.0 107.0 107.0 107.0 108.0 106.0 107.0 06:04:20 INFO - 2015-11-12 06:04:20,600 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,600 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:159.00 Median:162.00 stddev:5.96 (3.7%) stddev-sans-first:5.58 06:04:20 INFO - 2015-11-12 06:04:20,601 DEBUG : BROWSER_OUTPUT: Values: 151.0 165.0 152.0 153.0 165.0 167.0 155.0 158.0 162.0 162.0 06:04:20 INFO - 2015-11-12 06:04:20,601 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,601 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:186.30 Median:192.00 stddev:9.46 (4.9%) stddev-sans-first:8.51 06:04:20 INFO - 2015-11-12 06:04:20,601 DEBUG : BROWSER_OUTPUT: Values: 172.0 177.0 192.0 192.0 196.0 171.0 186.0 190.0 195.0 192.0 06:04:20 INFO - 2015-11-12 06:04:20,601 DEBUG : BROWSER_OUTPUT: 06:04:20 INFO - 2015-11-12 06:04:20,601 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:87.30 Median:88.00 stddev:2.45 (2.8%) stddev-sans-first:1.12 06:04:20 INFO - 2015-11-12 06:04:20,601 DEBUG : BROWSER_OUTPUT: Values: 81.0 87.0 90.0 88.0 88.0 88.0 88.0 88.0 86.0 89.0 06:04:20 INFO - 2015-11-12 06:04:20,601 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 06:04:20 INFO - 2015-11-12 06:04:20,602 DEBUG : BROWSER_OUTPUT: 06:04:21 INFO - 2015-11-12 06:04:21,344 INFO : Browser exited with error code: 0 06:04:21 INFO - 2015-11-12 06:04:21,400 INFO : Completed test kraken (00:01:03) 06:04:21 INFO - 2015-11-12 06:04:21,400 INFO : Starting test v8_7 06:04:21 INFO - 2015-11-12 06:04:21,400 DEBUG : operating with platform_type : mac_ 06:04:21 INFO - 2015-11-12 06:04:21,400 INFO : Initialising browser for v8_7 test... 06:04:21 INFO - 2015-11-12 06:04:21,415 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/tmpWndYVW/profile http://localhost:51237/getInfo.html 06:04:24 INFO - 2015-11-12 06:04:24,159 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 06:04:24 INFO - 2015-11-12 06:04:24,159 DEBUG : BROWSER_OUTPUT: colorDepth:24 06:04:24 INFO - 2015-11-12 06:04:24,159 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/689 06:04:24 INFO - 2015-11-12 06:04:24,159 DEBUG : BROWSER_OUTPUT: __metrics 06:04:24 INFO - 2015-11-12 06:04:24,175 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:04:24 INFO - 2015-11-12 06:04:24,936 INFO : Browser initialized. 06:04:24 INFO - 2015-11-12 06:04:24,936 INFO : Running cycle 1/1 for v8_7 test... 06:04:24 INFO - 2015-11-12 06:04:24,936 DEBUG : command line: /builds/slave/test/build/application/Nightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/T/tmpWndYVW/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 06:04:37 INFO - 2015-11-12 06:04:37,239 DEBUG : BROWSER_OUTPUT: RSS: Main: 228573184 06:04:37 INFO - 2015-11-12 06:04:37,239 DEBUG : BROWSER_OUTPUT: 06:04:59 INFO - 2015-11-12 06:04:59,826 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51237/tests/v8_7/run.html (next: http://localhost:51237/tests/v8_7/run.html) 06:05:00 INFO - 2015-11-12 06:05:00,076 DEBUG : BROWSER_OUTPUT: RSS: Main: 734228480 06:05:00 INFO - 2015-11-12 06:05:00,077 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,077 DEBUG : BROWSER_OUTPUT: __start_tp_report 06:05:00 INFO - 2015-11-12 06:05:00,077 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 06:05:00 INFO - 2015-11-12 06:05:00,077 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 06:05:00 INFO - 2015-11-12 06:05:00,077 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 06:05:00 INFO - 2015-11-12 06:05:00,078 DEBUG : BROWSER_OUTPUT: |0;Richards;199.4415636218588 06:05:00 INFO - 2015-11-12 06:05:00,078 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;240.3846153846154 06:05:00 INFO - 2015-11-12 06:05:00,078 DEBUG : BROWSER_OUTPUT: |2;Encrypt;373.4129947722181 06:05:00 INFO - 2015-11-12 06:05:00,078 DEBUG : BROWSER_OUTPUT: |3;Decrypt;6751.677852348993 06:05:00 INFO - 2015-11-12 06:05:00,078 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2298.8505747126437 06:05:00 INFO - 2015-11-12 06:05:00,078 DEBUG : BROWSER_OUTPUT: |5;Earley;962.4639076034649 06:05:00 INFO - 2015-11-12 06:05:00,078 DEBUG : BROWSER_OUTPUT: |6;Boyer;15904.761904761905 06:05:00 INFO - 2015-11-12 06:05:00,078 DEBUG : BROWSER_OUTPUT: |7;RegExp;36071.42857142857 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: |8;Splay;873.3624454148471 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;6770.27027027027 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: __end_tp_report 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: __startTimestamp1447337100074__endTimestamp 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: Number of tests: 10 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:199.44 Median:199.44 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: Values: 199.4 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:240.38 Median:240.38 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: Values: 240.4 06:05:00 INFO - 2015-11-12 06:05:00,079 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:373.41 Median:373.41 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: Values: 373.4 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:6751.68 Median:6751.68 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: Values: 6751.7 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2298.85 Median:2298.85 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: Values: 2298.9 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,080 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:962.46 Median:962.46 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: Values: 962.5 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:15904.76 Median:15904.76 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: Values: 15904.8 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:36071.43 Median:36071.43 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: Values: 36071.4 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:873.36 Median:873.36 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: Values: 873.4 06:05:00 INFO - 2015-11-12 06:05:00,081 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,082 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:6770.27 Median:6770.27 stddev:0.00 (0.0%) 06:05:00 INFO - 2015-11-12 06:05:00,082 DEBUG : BROWSER_OUTPUT: Values: 6770.3 06:05:00 INFO - 2015-11-12 06:05:00,082 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 06:05:00 INFO - 2015-11-12 06:05:00,082 DEBUG : BROWSER_OUTPUT: 06:05:00 INFO - 2015-11-12 06:05:00,879 INFO : Browser exited with error code: 0 06:05:00 INFO - 2015-11-12 06:05:00,902 INFO : Completed test v8_7 (00:00:39) 06:05:01 INFO - 2015-11-12 06:05:01,147 INFO : Completed test suite (00:20:19) 06:05:01 INFO - 2015-11-12 06:05:01,147 DEBUG : Working with test: dromaeo_css 06:05:01 INFO - 2015-11-12 06:05:01,147 DEBUG : Generating results file: dromaeo_css 06:05:01 INFO - 2015-11-12 06:05:01,148 DEBUG : Working with test: kraken 06:05:01 INFO - 2015-11-12 06:05:01,148 DEBUG : Generating results file: kraken 06:05:01 INFO - 2015-11-12 06:05:01,148 INFO : javascript benchmark 06:05:01 INFO - 2015-11-12 06:05:01,148 DEBUG : Working with test: v8_7 06:05:01 INFO - 2015-11-12 06:05:01,149 DEBUG : Generating results file: v8_7 06:05:01 INFO - 2015-11-12 06:05:01,149 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 06:05:01 INFO - 2015-11-12 06:05:01,214 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,55]] 06:05:01 INFO - 2015-11-12 06:05:01,214 DEBUG : process_Request line: dromaeo_css 5404.67 graph.html#tests=[[72,64,55]] 06:05:01 INFO - 2015-11-12 06:05:01,215 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 06:05:01 INFO - 2015-11-12 06:05:01,266 DEBUG : process_Request line: kraken 1826.60 graph.html#tests=[[232,64,55]] 06:05:01 INFO - 2015-11-12 06:05:01,266 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 06:05:01 INFO - 2015-11-12 06:05:01,299 DEBUG : process_Request line: v8_7 15284.36 graph.html#tests=[[230,64,55]] 06:05:01 INFO - 2015-11-12 06:05:01,300 INFO : javascript benchmark 06:05:01 INFO - 2015-11-12 06:05:01,302 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [280.82588794947134, 281.7886585061204, 282.77801925488495, 286.25527410433415, 286.447156987015, 8470.36472264581, 8530.957345213264, 15102.169380684058, 15716.214189290518, 15973.041617502944, 8380.748577542683, 9356.953215233914, 9427.95286023569, 9960.701178964624, 9965.701028969142, 3539.82300884956, 3676.8529258829612, 3700.0749812546865, 3703.0557207911943, 3753.3619284721663, 2661.5076210901047, 2709.4581083783223, 2796.3288810685494, 3629.891103266906, 3696.3531382008177, 3832.9041773955737, 3889.241597888413, 3969.3847453644585, 3985.4021896715435, 4003.619656132663, 3946.3685810270217, 3949.1311911379453, 3957.7427467214684, 3979.880603581897, 3995.360742281221, 3096.1330827368374, 3389.3729660012978, 3422.281320922609, 3446.7931924084637, 3454.9481757773656, 10729.624463143831, 10893.782124357547, 10935.234533582652, 10952.34285942846, 11040.668779936615, 1512.6142833577367, 1540.468538354266, 1557.4938145102888, 1598.4085888221316, 1651.4632744358012, 7936.436817659127, 7993.0, 8100.554469504175, 8129.634166462464, 8159.306458950996, 1296.714722760991, 1298.1951190262002, 1303.3352989975085, 1304.7064410507655, 1323.3846261488359, 46949.530504694856, 47446.5255347449, 47554.0, 47629.761851190524, 48030.27954580684, 5266.526012658803, 5356.812511562077, 5370.060239458079, 5390.245365648812, 5418.620696551204, 5928.140419639129, 6139.10982907476, 6155.076738489262, 6165.722542485599, 6195.752169913243, 4357.4988876279, 4376.737395756265, 4424.247877860771, 4425.955740442619, 4432.445944256968, 4593.977030114828, 4615.861524154281, 4631.282151266559, 4668.043051174501, 4672.345871577982, 2374.8456350337174, 2405.506871091422, 2420.9515809683708, 2430.6475561043903, 2437.2566367258155, 860.9569521523899, 865.16079402979, 869.4261787220404, 874.4447275979799, 930.4649826349876, 297.0657282845482, 301.0726960960237, 316.5355187473085, 337.5476861006263, 370.3500356873723, 8488.660453581911, 8616.0, 8806.075362087016, 8837.381383303107, 8977.10228977097, 310.870988539758, 311.68831168831167, 326.0820789477613, 331.0614408152865, 350.0915125249972, 4574.428196475441, 5101.132807422747, 5159.613029022838, 5260.158374660036, 5302.946970530323, 429686.0, 439398.0, 443863.0, 453492.0, 455452.0, 55017.1747423789, 57795.71102144462, 58267.70866145642, 59097.40902591005, 59889.40110598925, 406.6705968165795, 420.7664746065902, 422.613308822424, 424.24907912994445, 432.3752178102612, 9159.084091591054, 9192.080791920755, 9216.262698983932, 9402.34183607141, 9426.528673566432, 28259.858700707187, 28262.576061358686, 28652.713472865005, 28770.712292876804, 29682.10953671393, 35752.106197345274, 36090.27819443649, 37469.62530374771, 40061.799691002525, 40671.983200420225, 4851.223804191312, 5058.140116180185, 5166.3800343958965, 5202.609804264771, 5218.26944227816, 9356.859647105162, 9610.231181505602, 9708.320417570701, 9877.357971732103, 9938.850917236392, 7138.750143745152, 7320.9267907320245, 8247.381446391424, 8441.535715535705, 8455.619497122521, 6701.832454188684, 7803.453758237096, 7976.84046319082, 8270.669173233004, 8320.16798320163, 8631.91368086311, 8632.352573556882, 8660.133986601542, 8663.48019118855, 8787.121287871161, 5146.481787872512, 5166.638335316492, 5249.396319423316, 5272.130098533852, 5307.071262528964, 7928.088269849041, 8091.716789912325, 8233.46482478637, 8573.485590864568, 8822.955885220534], "dojo.html": [2577.768000879921, 2648.033467784258, 2657.3223827923875, 2672.412069344745, 2673.9598906016413, 4334.4798624165105, 4384.517703052662, 4449.799759010844, 4469.128519938613, 4501.437320334958, 4289.871303860881, 4334.41485399471, 4364.869053928379, 4365.934510982338, 4488.596026357627, 3956.7273305253143, 4053.2298863215897, 4163.229802486535, 4222.535521092677, 4293.849715259967, 4194.161167766459, 4250.404943307939, 4298.957010429903, 4321.546237645033, 4323.200207961521, 4046.150308435232, 4094.1197642506704, 4097.0, 4176.832926682929, 4229.006183546864, 4171.311733563958, 4227.704060715751, 4255.063885945087, 4259.424977628011, 4284.014676624394, 4194.2869712149, 4195.769232692201, 4197.601227883346, 4203.957960420387, 4266.104118135196, 4218.599233072884, 4346.521882592912, 4420.712653677533, 4425.491068527096, 4471.5081341052455, 4664.323673067386, 4676.3453116563705, 4718.8584342469785, 4768.117898188846, 4773.045390921795, 4754.477007529169, 4804.903901921977, 4819.42166939966, 4868.172410690191, 4880.511948805127, 4315.0, 4315.935260971088, 4415.955840441555, 4456.08650226706, 4466.665000125004, 4761.285807128958, 4842.370491836109, 4844.467108618049, 4879.878003049952, 4897.853064408074, 4682.508336624674, 4697.13103075932, 4702.130105930414, 4732.929006064912, 4758.262469317261, 4576.954230457653, 4587.72473651582, 4681.204195286809, 4705.976470117627, 4748.6438517111355, 4662.813487460531, 4718.127146477913, 4732.834350797705, 4784.569388755029, 4798.640101992295, 4704.647151463585, 4746.620270378361, 4750.429948406213, 4796.088743138793, 4820.39745031871, 3615.204654975901, 3639.909002274964, 3728.8881333560034, 3743.737938344344, 3791.298609757204, 3375.4936759486272, 3392.457206846893, 3411.0790086676457, 3420.8973730788116, 3464.133966508373, 4299.97850010748, 4459.777011149429, 4461.0, 4481.663875209372, 4501.639868810487, 4619.93070103942, 4632.97683511587, 4717.764111794397, 4736.621070314367, 4740.691855029412, 4412.073464572476, 4431.069475410135, 4450.866474005785, 4479.0370070434365, 4495.842645507391, 4026.758394496281, 4221.113566151143, 4221.176870510221, 4232.534421213664, 4256.170046840836, 4824.204006338985, 4831.299461578122, 4883.389576302962, 4906.754662266872, 4915.901681966269, 4726.550977657117, 4728.101660684597, 4745.857624271277, 4748.09786140646, 4763.3807605011125, 4791.47293797689, 4876.073546026244, 4881.121398148367, 4914.385701787277, 4952.232403977389, 4550.499445061107, 4569.428821397325, 4628.514006029453, 4761.833335833229, 4786.138495070921, 4698.647601429838, 4733.5266473352385, 4775.594074503706, 4777.259524773665, 4777.570018698334, 4386.71486353386, 4632.652551058617, 4659.2079346511855, 4671.042436300482, 4700.976495117503, 4459.375687403701, 4519.706219095749, 4524.5249248828395, 4546.863594092182, 4637.049404871926, 4537.319402089581, 4544.772761361853, 4554.43069616298, 4580.358749774968, 4691.061787642417, 4531.116432295803, 4656.301554766812, 4671.322658214608, 4710.764461776966, 4744.288356746516, 4496.77516124186, 4498.955010449854, 4530.343100250379, 4583.908321833478, 4633.606143477842], "mootools.html": [1033.6795593366053, 1432.197969137283, 1504.217806740495, 1507.3593722667867, 1507.879369650428, 6088.26940767108, 6315.621062736233, 6404.775832845851, 6649.700763465644, 6799.252082270947, 6553.50848686348, 6572.375624315694, 6579.967100164505, 6609.867802643944, 6721.3278672132765, 1719.8968061916262, 1732.0, 1746.083306264215, 1764.8146944570829, 1767.4874286456911, 1847.7875044369869, 1855.4619160443456, 1855.8979256140906, 1871.9719204211947, 1893.422506135628, 1817.8091300413464, 1817.990910045448, 1828.4423250908467, 1845.2526726675717, 1852.0739630184908, 1780.172219917738, 1800.3788692900994, 1810.2396993262862, 1819.6633622779827, 1841.5027942455463, 1716.064744714134, 1742.35532852844, 1749.9825001749946, 1752.19399076425, 1760.0407777761152, 5702.65784052954, 6338.651374174418, 6489.870202595969, 6516.902246466307, 6572.07990881277, 3530.435130379127, 3592.46113083037, 3607.6753092221825, 3786.962130378716, 3926.960730392688, 2312.3987763181526, 2323.4075310795806, 2353.7646235376324, 2356.0693526057285, 2427.2475532584954, 736.3189050128609, 737.4616529933126, 755.0788038592908, 762.4853224073784, 781.2421950707804, 8614.0, 8697.652093916236, 8705.129487051308, 8714.477131372201, 8715.346349023848, 3298.4392653249006, 3405.9489107663403, 3433.0902310887636, 3465.480177973274, 3482.2513159670793, 7645.350145237606, 7691.0, 7713.4214933880185, 7731.806704832424, 7776.222377762291, 3943.72393932422, 3953.9604603954167, 3962.346212874901, 4030.7984600769846, 4031.75809451428, 3586.2468881534646, 3601.0, 3606.4229723244157, 3621.6740493355724, 3623.58328792187, 2774.9583756243674, 2835.631367922198, 2841.6732075811133, 2859.6568411790304, 2903.767698584108, 905.6830109461636, 906.2523418180028, 911.6353458616474, 918.0773322810533, 919.1406035356963, 893.6425429827991, 911.5123408976166, 929.363386080537, 931.9627214911328, 1138.9430528473542, 6047.244094488189, 6071.362506936796, 6097.481714054266, 6107.236595425572, 6112.572119951649, 338.87122893300386, 350.8807005618102, 359.7212160575575, 361.81366596202975, 1007.5466040281902, 4727.125481785881, 4926.433460152057, 4942.20924652054, 4946.653734238641, 4982.825601104017, 7126.144862616416, 7324.487285889936, 7336.523125996793, 7459.962700186465, 7827.6477558510005, 7563.432742544332, 7633.885491717629, 7639.0, 7716.575588342583, 7782.961085194538, 6084.421979911901, 6122.571420000646, 6142.78500252489, 6205.410486003822, 6224.62652240867, 6080.422359875804, 6083.452489275986, 6114.6942652868065, 6134.38656134383, 6195.504359651127, 6733.562318449285, 6844.281350458329, 6879.759208427681, 6941.93058069433, 7090.220075791555, 6893.517453778388, 7032.929670703432, 7188.820279492846, 7241.637918104179, 7242.3843973262865, 5452.509274165344, 5499.395066542597, 5511.696856672921, 5543.584231182758, 5562.22128901946, 5862.267216597926, 5942.524598032233, 6158.137860699595, 6357.078223657636, 6363.61818290904, 5809.099589563624, 5841.970790146022, 5860.706964651665, 5868.413158684098, 5916.0, 5623.8594035149445, 5764.193012978102, 5766.192733017465, 5805.10020946754, 5840.240768700041, 5893.174955506318, 5900.409959004065, 5912.201852749824, 5929.52563794904, 5972.940270597413, 5316.494932981361, 5332.5733941283825, 5336.839894803162, 5367.490088441592, 5462.863428414322, 5442.891142177214, 5474.397816240131, 5477.4796394342475, 5508.283923089973, 5536.806211782568], "ext.html": [463.68701126739455, 474.88602735343505, 476.7377942131829, 479.92561153021285, 496.38696210180444, 26137.215883523477, 26733.465330693398, 32619.184520386974, 33399.332013359715, 33447.498287525705, 35503.4674479883, 35588.28823423536, 35740.285194296164, 35760.0, 36401.45397819028, 6947.235804061549, 7749.690012399497, 7921.841563168733, 7930.643121059537, 8097.676092956274, 6884.414824739903, 6923.411510021654, 9334.906650933506, 9444.338896277264, 9454.763630909214, 9330.253579713606, 9368.578413971387, 9447.338686291961, 9450.14948654621, 9525.380850244712, 6848.6918088686125, 7077.186123595801, 8884.378093533454, 9278.072192780735, 9403.341766076377, 6921.757738479179, 9092.818143637156, 9285.58214880332, 9399.859002114974, 9406.106419890168, 32967.50548741771, 33047.0, 33336.0, 33374.666253337644, 33441.6655833441, 2473.3816545863533, 2479.5164942836154, 2538.428853507946, 2543.160756950202, 2840.758535524483, 22903.42741431461, 23004.079836806675, 23105.88447057771, 23206.187783427667, 23309.0, 2030.7867673894177, 2042.458748431667, 2054.6917962305624, 2078.833693304532, 2091.215794077221, 235608.0, 235772.0, 237125.0, 239498.0, 239598.0, 48258.758706206245, 48385.5161448388, 48542.27186592204, 48703.5129648699, 48961.26558101631, 47178.528214717415, 48187.0, 49351.50648493469, 51225.23162152571, 54760.0, 12524.686882828002, 12590.559330423392, 12707.809382859265, 12733.681657958625, 12750.55373061957, 9620.278479114095, 9638.614455421844, 9643.807123857483, 9692.273079518924, 9708.417494950325, 15165.165915874511, 15229.162396068323, 15252.618684532976, 15305.311260993281, 15409.0, 6682.365175308338, 6966.407855332353, 6993.125859267591, 7005.614691191931, 7040.894386584206, 704.7885634309687, 715.5635062611802, 724.760828926453, 735.7314580178196, 855.4952577979022, 23150.65274020891, 23336.29991100236, 23667.881660591585, 23718.644220336708, 23739.406514836923, 854.5940678177816, 893.9642414303355, 898.4025622960658, 954.6229239450378, 963.6723514005272, 12144.514219431123, 12224.388780560936, 12360.629181124581, 12383.380830958416, 12443.626691199279, 258724.0, 263283.0, 263721.0, 264368.0, 267562.0, 45165.774171128935, 45170.32244516335, 45269.09461810811, 45523.54476455193, 45910.0, 1127.103952357861, 1128.8814674459227, 1134.982975255372, 1145.8682251541013, 1157.473349625935, 23029.88485057564, 23119.0, 23211.53576928486, 23217.0, 23391.298261052194, 34203.31593368168, 35154.64845351514, 38859.2228155441, 39867.40198897077, 40100.39849402203, 209902.0, 211579.0, 215022.0, 215779.0, 215780.0, 22228.555428891654, 22978.770212298332, 24409.63385549254, 24667.629985549873, 25087.87456062708, 26807.597886031333, 33245.667543324256, 33858.49212261769, 34028.82985585056, 34839.0, 26375.868120659274, 28259.717402825707, 29457.852710737166, 29508.0, 30328.241793955327, 28013.439731205668, 28755.28111797222, 29021.274468138465, 29192.854035729684, 29414.41171176607, 27521.31196720098, 27576.17271481859, 27919.581206282328, 27969.44061118807, 28406.857965710038, 24612.876935615925, 26167.214983550522, 26197.607035894096, 26204.86897565576, 26920.192394228205, 19877.30429434963, 19999.0, 20163.193472260944, 20195.495112622302, 20959.790402095783], "prototype.html": [251.91938579654513, 260.7067049569236, 261.53969014534414, 264.3470627549952, 265.27711984841307, 4938.2098864181735, 4958.727270000149, 4987.501249875011, 5018.673786203894, 5079.822206222788, 4806.5193480651915, 4839.8790030249265, 4895.31465594817, 4930.679505832119, 4948.975255123728, 3846.499955005845, 3851.05649115967, 3868.303705333039, 3885.592012838654, 3891.6497515223623, 3895.668868146211, 3923.8234279457492, 3932.6853851691794, 3942.7240093193486, 3954.604539546037, 3858.0, 3877.495925529677, 3891.1633998690277, 3899.551551571563, 3948.8420463181437, 3860.305145073886, 3885.592012838654, 3899.707521935866, 3913.5303763548272, 3965.841366345357, 3271.5910511186103, 3311.536384906115, 3320.6181289151814, 3325.5011748237716, 3351.262722201112, 4888.0, 4897.60819134472, 4902.730349830758, 4917.0, 5000.574951129159, 4241.703080784347, 4266.338717498793, 4286.164197981395, 4309.4397728295435, 4324.740515569076, 5204.141316682742, 5217.869553261199, 5233.790648374099, 5260.447652996457, 5269.025230332362, 3291.2101095736853, 3329.583802024747, 3342.29811739535, 3430.365382404238, 3503.24680193757, 5365.651232669864, 5423.186522021729, 5430.321209848769, 5486.807961721321, 5529.861753456155, 3438.5014172944784, 3543.255916257615, 3546.7517273790586, 3581.1047238190454, 3606.8737594184076, 3419.794812311269, 3427.143214196451, 3439.673231043047, 3493.7729047612333, 3623.1847834237087, 4104.527979282361, 4153.169366126726, 4162.125953549788, 4171.791410429466, 4183.895402614898, 5149.124648809711, 5220.92168617471, 5220.92168617471, 5223.425423203445, 5284.4187139414635, 1287.8261434706194, 1303.1985329022773, 1306.7843805772131, 1307.7123032932739, 1317.8748018938186, 819.6393586821779, 844.5650489997656, 845.6955496021427, 852.7143406958738, 867.6702852915852, 4981.701097934136, 4982.153033984231, 4985.4266759323145, 5028.069807085701, 5049.116404629175, 5405.297311349499, 5415.729213539307, 5442.700651464128, 5483.067878460672, 5501.944980550224, 4956.479569645207, 4970.627202959792, 4975.378077740283, 4976.0, 4986.227134794112, 2920.8101473404163, 2946.0, 3000.6699263081046, 3015.8341291228753, 3044.2845931206148, 5603.842520629505, 5617.887642247132, 5670.432956704297, 5728.255326807488, 5759.510441612426, 5539.390667026624, 5560.5551555876245, 5578.972105139448, 5602.579806514527, 5686.687232202268, 5591.356993945748, 5600.4959553640365, 5623.522000629992, 5637.098064309691, 5736.110902810071, 5257.631965762513, 5369.436209197978, 5430.51125398716, 5454.809081682122, 5477.1510415885605, 5311.229871668509, 5332.626716129989, 5332.706701131475, 5399.4600539945695, 5408.242846001642, 5629.4652008059165, 5640.492355688008, 5679.34687510925, 5693.459121383462, 5720.914186287126, 3593.802340871277, 3607.2244467439627, 3608.657177568127, 3618.656227658368, 3621.9456708148873, 5223.242629818579, 5269.046691935704, 5327.760250788801, 5441.347038355423, 5533.363663178786, 5227.320448341843, 5281.128613778684, 5284.550813180923, 5297.655652382583, 5411.107167317348, 5318.282031925641, 5319.281896943863, 5338.3060202173465, 5343.599230057684, 5349.090654588651, 5140.537351638221, 5158.793648254028, 5203.713795741119, 5209.0, 5258.50044245796, 5186.507281808223, 5246.711430871339, 5269.525742683177, 5374.892502149857, 5405.432429594836, 5276.630635855453, 5282.207668849704, 5314.97342513285, 5348.983693098299, 5368.194770784257], "yui.html": [626.8182227154125, 630.9337519560446, 634.6763150793097, 636.1157990393357, 643.3727116061839, 10682.946585267062, 10890.292131011478, 11324.547018119276, 11762.411879406038, 11965.76068478631, 9776.755581110458, 11784.705382365446, 12043.75912481752, 12109.697257568565, 12190.207636503643, 573.2061095382904, 587.8354060862965, 717.7559629725893, 739.7004213293625, 740.5371642723298, 695.9478039147059, 719.8164468060637, 722.9240929702358, 739.589527812064, 740.8592367450194, 758.2682711183706, 760.4106817216674, 765.7243392378739, 766.7853001159656, 772.5364781131333, 747.439420434674, 752.8833030880222, 753.0473950452682, 758.0410780362845, 763.480833033537, 553.3111276460792, 555.3419198250086, 557.5316733943466, 560.2660514725723, 561.3628531616645, 11262.493187806487, 11335.979761821392, 11389.259698119597, 11397.202195846294, 11400.25898316615, 7241.493095483318, 7341.1557670868, 7432.516886402421, 7908.209179082103, 7920.920790792134, 6685.39831415175, 7087.92912070883, 7168.319009694071, 7607.885881711779, 7649.349805266559, 2370.810335173182, 2385.33210701004, 2476.4304210031614, 2479.330580743207, 2586.1594981631047, 38176.236475270336, 38375.232495349934, 38396.80801596002, 38889.027774305585, 38962.0, 5585.0, 5625.578081643893, 5709.257796486513, 5716.114002329646, 5814.825555233349, 9853.458059806779, 9863.40819550815, 9873.259505537113, 9950.203983681433, 10012.349197302152, 5109.3613298337705, 5181.4041385240425, 5391.056565101092, 5983.700814959235, 6186.845328866814, 3126.155937896755, 3198.3923054620013, 3253.4957081652383, 3291.2182960014347, 3318.4192766265805, 2508.535920854648, 2553.272317389535, 2554.514642217973, 2563.3207200091992, 2587.9648140743852, 347.7722092029725, 354.601073791984, 355.3940531394019, 358.9982050089733, 360.0961586418109, 382.31183869035624, 421.6879509163197, 448.2424702253182, 499.7739590940543, 534.4014703531991, 6170.254236864642, 6513.609183449008, 6656.467482601381, 6771.966140169267, 6786.185657721105, 374.6497025281371, 477.1459088232026, 492.8964917367393, 494.7699319816231, 537.5081800152816, 2900.1734505665786, 2959.5116805726816, 3093.597832281789, 3195.1498444374474, 3258.3809076275434, 48100.75949620229, 48412.0, 49126.0, 49225.0, 49279.014419711406, 39976.400353994715, 40460.1907961845, 40734.796326018775, 41051.0, 42279.365809512885, 35888.461673074926, 36778.712745053796, 36816.63183368132, 37133.442998354505, 37528.62471375306, 6643.501737369813, 6814.557053791487, 7050.5769653820935, 7094.680739366844, 7154.35610795031, 28482.715172848006, 29412.558811617415, 29639.25901852471, 29852.70147298499, 30749.23126921845, 38495.0, 38844.223115538094, 39155.0, 43137.78431107824, 43887.34168987404, 8781.824363512822, 8950.373473856767, 9300.209482193819, 9335.299852510952, 9399.530023498934, 9240.306976976619, 9401.670941517013, 9486.77683890448, 9749.80500389974, 9901.752456188653, 8905.243054340453, 9022.774430639287, 9195.954020230123, 9384.57769400365, 9575.904240957501, 9052.954735226282, 9075.0, 9118.680846170351, 9155.633774648939, 9173.44959302444, 8677.652893884426, 8761.605727742139, 8824.205821476098, 8831.69089081879, 9170.220531254918, 7493.250674932463, 7646.617669116411, 7749.883751743616, 7774.92225077742, 7857.174996625272, 7248.60132692707, 7515.511491753018, 7802.0, 7912.0901096374655, 8170.714025009096]}, "summary": {"lowerIsBetter": false, "suite": 5404.66971238944, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 5335.169288751708, "unit": "ms", "value": 5335.169288751708}, "dojo.html": {"lowerIsBetter": false, "filtered": 4403.1511898422705, "unit": "ms", "value": 4403.1511898422705}, "mootools.html": {"lowerIsBetter": false, "filtered": 3608.55142408526, "unit": "ms", "value": 3608.55142408526}, "ext.html": {"lowerIsBetter": false, "filtered": 15188.086918754881, "unit": "ms", "value": 15188.086918754881}, "prototype.html": {"lowerIsBetter": false, "filtered": 3942.2765738215066, "unit": "ms", "value": 3942.2765738215066}, "yui.html": {"lowerIsBetter": false, "filtered": 4909.922518543163, "unit": "ms", "value": 4909.922518543163}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0034"}, "testrun": {"date": 1447335881, "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": "20151112034048", "branch": "Fx-Team", "revision": "8921c18fecfc098d8dceec686a05345054e299e0"}}, {"talos_counters": {}, "results": {"audio-dft": [187.0, 196.0, 196.0, 195.0, 195.0, 190.0, 192.0, 198.0, 197.0, 197.0], "ai-astar": [124.0, 131.0, 124.0, 131.0, 129.0, 126.0, 115.0, 135.0, 121.0, 132.0], "imaging-gaussian-blur": [142.0, 148.0, 142.0, 142.0, 149.0, 140.0, 141.0, 135.0, 142.0, 148.0], "audio-beat-detection": [190.0, 159.0, 185.0, 194.0, 155.0, 181.0, 180.0, 153.0, 198.0, 155.0], "json-stringify-tinderbox": [70.0, 86.0, 79.0, 80.0, 80.0, 79.0, 83.0, 83.0, 84.0, 84.0], "stanford-crypto-pbkdf2": [172.0, 177.0, 192.0, 192.0, 196.0, 171.0, 186.0, 190.0, 195.0, 192.0], "json-parse-financial": [67.0, 69.0, 67.0, 69.0, 69.0, 72.0, 75.0, 81.0, 73.0, 72.0], "stanford-crypto-sha256-iterative": [81.0, 87.0, 90.0, 88.0, 88.0, 88.0, 88.0, 88.0, 86.0, 89.0], "audio-fft": [88.0, 93.0, 103.0, 145.0, 80.0, 85.0, 83.0, 85.0, 132.0, 80.0], "imaging-darkroom": [149.0, 155.0, 154.0, 154.0, 147.0, 154.0, 154.0, 152.0, 147.0, 154.0], "stanford-crypto-ccm": [151.0, 165.0, 152.0, 153.0, 165.0, 167.0, 155.0, 158.0, 162.0, 162.0], "audio-oscillator": [115.0, 117.0, 165.0, 109.0, 109.0, 110.0, 156.0, 108.0, 106.0, 150.0], "stanford-crypto-aes": [97.0, 101.0, 107.0, 105.0, 107.0, 107.0, 107.0, 108.0, 106.0, 107.0], "imaging-desaturate": [121.0, 124.0, 124.0, 123.0, 124.0, 124.0, 124.0, 123.0, 125.0, 125.0]}, "summary": {"lowerIsBetter": true, "suite": 1826.6, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 97.4, "unit": "ms", "value": 97.4}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 186.3, "unit": "ms", "value": 186.3}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 175.0, "unit": "ms", "value": 175.0}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 159.0, "unit": "ms", "value": 159.0}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 152.0, "unit": "ms", "value": 152.0}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 71.4, "unit": "ms", "value": 71.4}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 124.5, "unit": "ms", "value": 124.5}, "ai-astar": {"lowerIsBetter": true, "filtered": 126.8, "unit": "ms", "value": 126.8}, "audio-dft": {"lowerIsBetter": true, "filtered": 194.3, "unit": "ms", "value": 194.3}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 87.3, "unit": "ms", "value": 87.3}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 80.8, "unit": "ms", "value": 80.8}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 142.9, "unit": "ms", "value": 142.9}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 105.2, "unit": "ms", "value": 105.2}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 123.7, "unit": "ms", "value": 123.7}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0034"}, "testrun": {"date": 1447335881, "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": "20151112034048", "branch": "Fx-Team", "revision": "8921c18fecfc098d8dceec686a05345054e299e0"}}, {"talos_counters": {}, "results": {"DeltaBlue": [240.3846153846154], "Encrypt": [373.4129947722181], "NavierStokes": [6770.27027027027], "Decrypt": [6751.677852348993], "Splay": [873.3624454148471], "Richards": [199.4415636218588], "RegExp": [36071.42857142857], "Earley": [962.4639076034649], "Boyer": [15904.761904761905], "RayTrace": [2298.8505747126437]}, "summary": {"lowerIsBetter": false, "suite": 15284.35540729935, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 275.05087999999995, "unit": "score", "value": 275.05087999999995}, "Encrypt": {"lowerIsBetter": false, "filtered": 712.8327179999998, "unit": "score", "value": 712.8327179999998}, "NavierStokes": {"lowerIsBetter": false, "filtered": 219.19361277445128, "unit": "score", "value": 219.19361277445128}, "Decrypt": {"lowerIsBetter": false, "filtered": 39.42442246520872, "unit": "score", "value": 39.42442246520872}, "Splay": {"lowerIsBetter": false, "filtered": 93.30719500000004, "unit": "score", "value": 93.30719500000004}, "RegExp": {"lowerIsBetter": false, "filtered": 25.2550297029703, "unit": "score", "value": 25.2550297029703}, "Richards": {"lowerIsBetter": false, "filtered": 177.00422799999996, "unit": "score", "value": 177.00422799999996}, "Earley": {"lowerIsBetter": false, "filtered": 692.4550570000002, "unit": "score", "value": 692.4550570000002}, "Boyer": {"lowerIsBetter": false, "filtered": 41.90336227544907, "unit": "score", "value": 41.90336227544907}, "RayTrace": {"lowerIsBetter": false, "filtered": 321.89521500000006, "unit": "score", "value": 321.89521500000006}}}, "test_machine": {"platform": "x86_64", "osversion": "OS X 10.10.2", "os": "mac", "name": "t-yosemite-r5-0034"}, "testrun": {"date": 1447335881, "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": "20151112034048", "branch": "Fx-Team", "revision": "8921c18fecfc098d8dceec686a05345054e299e0"}}] 06:05:01 INFO - RETURN: dromaeo_css: 5404.67 06:05:01 INFO - RETURN: kraken: 1826.60 06:05:01 INFO - RETURN: v8_7: 15284.36 06:05:01 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,55]]", "result": "15284.36"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,55]]", "result": "1826.60"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,55]]", "result": "5404.67"}}} 06:05:01 INFO - Return code: 0 06:05:01 INFO - # TBPL SUCCESS # 06:05:01 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 06:05:01 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 06:05:01 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 06:05:01 INFO - 2015-11-12 06:05:01.411 screenresolution[1967:18257] starting screenresolution argv=screenresolution get 06:05:01 INFO - 2015-11-12 06:05:01.415 screenresolution[1967:18257] Display 0: 1600x1200x32@60 06:05:01 INFO - 2015-11-12 06:05:01.421 screenresolution[1968:18260] starting screenresolution argv=screenresolution list 06:05:01 INFO - Available Modes on Display 0 06:05:01 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 06:05:01 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 06:05:01 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 06:05:01 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 06:05:01 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 06:05:01 INFO - Intel HD Graphics 3000: 06:05:01 INFO - Chipset Model: Intel HD Graphics 3000 06:05:01 INFO - Type: GPU 06:05:01 INFO - Bus: Built-In 06:05:01 INFO - VRAM (Total): 512 MB 06:05:01 INFO - VRAM (Dynamic, Max): 10 06:05:01 INFO - Vendor: Intel (0x8086) 06:05:01 INFO - Device ID: 0x0116 06:05:01 INFO - Revision ID: 0x0009 06:05:01 INFO - Displays: 06:05:01 INFO - Display: 06:05:01 INFO - Resolution: 1600 x 1200 @ 60 Hz 06:05:01 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 06:05:01 INFO - Display Serial Number: 1600x1200 60 06:05:01 INFO - Main Display: Yes 06:05:01 INFO - Mirror: Off 06:05:01 INFO - Online: Yes 06:05:01 INFO - Rotation: Supported 06:05:01 INFO - Return code: 0 06:05:01 INFO - Running post-action listener: _resource_record_post_action 06:05:01 INFO - Running post-run listener: _resource_record_post_run 06:05:02 INFO - Total resource usage - Wall time: 1263s; CPU: 30.0%; Read bytes: 2830336; Write bytes: 685840384; Read time: 1105; Write time: 48757 06:05:02 INFO - install - Wall time: 43s; CPU: 30.0%; Read bytes: 336558592; Write bytes: 334231552; Read time: 36941; Write time: 5605 06:05:02 INFO - run-tests - Wall time: 1221s; CPU: 30.0%; Read bytes: 2830336; Write bytes: 340406272; Read time: 1105; Write time: 42716 06:05:02 INFO - Running post-run listener: _upload_blobber_files 06:05:02 INFO - Blob upload gear active. 06:05:02 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 06:05:02 INFO - Copying logs to upload dir... 06:05:02 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1320.297987 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 0 secs) (at 2015-11-12 06:05:02.877626) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-12 06:05:02.881756) ========= 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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners TMPDIR=/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.010436 build_url: 'https://queue.taskcluster.net/v1/task/2WYrRlklSa-Vci6AfbHjSA/artifacts/public/build/firefox-45.0a1.en-US.mac.dmg' ========= master_lag: 0.02 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-12 06:05:02.913094) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 06:05:02.913887) ========= 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.4LzGGnxJQI/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.S4pfjpQ3pV/Listeners TMPDIR=/var/folders/tl/2ct7hv6552d6h3hfz53l67k000000w/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.005473 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-12 06:05:02.968536) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-12 06:05:02.969337) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-12 06:05:02.970257) ========= ========= Total master_lag: 0.25 =========