builder: mozilla-central_yosemite_r7_test-dromaeojs slave: t-yosemite-r7-0309 starttime: 1475759096.85 results: success (0) buildid: 20161006030208 builduid: f72f9a2146e041f7833d5c7dffd4dbed revision: 777fb63db8de8d78b64b8141d1a998397275dd03 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:56.854696) ========= master: http://buildbot-master134.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:56.855141) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:56.855425) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:56.879850) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:56.880242) ========= 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.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners TMPDIR=/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False --2016-10-06 06:04:56-- 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% 227M=0s 2016-10-06 06:04:56 (227 MB/s) - 'archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.090609 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:56.993028) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:56.993373) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners TMPDIR=/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.026848 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:57.041705) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-06 06:04:57.042072) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 777fb63db8de8d78b64b8141d1a998397275dd03 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 777fb63db8de8d78b64b8141d1a998397275dd03 --destination scripts --debug'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners TMPDIR=/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 2016-10-06 06:04:57,121 truncating revision to first 12 chars 2016-10-06 06:04:57,121 Setting DEBUG logging. 2016-10-06 06:04:57,121 attempt 1/10 2016-10-06 06:04:57,121 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/777fb63db8de?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-06 06:04:58,694 unpacking tar archive at: mozilla-central-777fb63db8de/testing/mozharness/ program finished with exit code 0 elapsedTime=1.854857 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-06 06:04:58.918311) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:58.918639) ========= script_repo_revision: 777fb63db8de8d78b64b8141d1a998397275dd03 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:58.919054) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:58.919323) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-06 06:04:58.937421) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 16 secs) (at 2016-10-06 06:04:58.937828) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', 'Firefox', '--cfg', 'talos/mac_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: Apple_PubSub_Socket_Render=/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners TMPDIR=/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False 06:04:59 INFO - MultiFileLogger online at 20161006 06:04:59 in /builds/slave/test 06:04:59 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/mac_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 06:04:59 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:04:59 INFO - {'append_to_log': False, 06:04:59 INFO - 'base_work_dir': '/builds/slave/test', 06:04:59 INFO - 'blob_upload_branch': 'Firefox', 06:04:59 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:04:59 INFO - 'branch': 'Firefox', 06:04:59 INFO - 'buildbot_json_path': 'buildprops.json', 06:04:59 INFO - 'config_files': ('talos/mac_config.py',), 06:04:59 INFO - 'default_actions': ('clobber', 06:04:59 INFO - 'read-buildbot-config', 06:04:59 INFO - 'download-and-extract', 06:04:59 INFO - 'populate-webroot', 06:04:59 INFO - 'create-virtualenv', 06:04:59 INFO - 'install', 06:04:59 INFO - 'run-tests'), 06:04:59 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:04:59 INFO - 'download_minidump_stackwalk': True, 06:04:59 INFO - 'download_symbols': 'ondemand', 06:04:59 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:04:59 INFO - 'tooltool.py': '/tools/tooltool.py', 06:04:59 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:04:59 INFO - '/tools/misc-python/virtualenv.py')}, 06:04:59 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:04:59 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:04:59 INFO - 'installer_path': 'installer.exe', 06:04:59 INFO - 'log_level': 'info', 06:04:59 INFO - 'log_name': 'talos', 06:04:59 INFO - 'log_to_console': True, 06:04:59 INFO - 'minidump_stackwalk_path': 'macosx64-minidump_stackwalk', 06:04:59 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/macosx64/releng.manifest', 06:04:59 INFO - 'opt_config_files': (), 06:04:59 INFO - 'pip_index': False, 06:04:59 INFO - 'postflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 06:04:59 INFO - 'cmd': ('bash', 06:04:59 INFO - '-c', 06:04:59 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 06:04:59 INFO - 'enabled': True, 06:04:59 INFO - 'halt_on_failure': False, 06:04:59 INFO - 'name': 'check_screen_resolution'},), 06:04:59 INFO - 'preflight_run_cmd_suites': ({'architectures': ('32bit', '64bit'), 06:04:59 INFO - 'cmd': ('bash', 06:04:59 INFO - '-c', 06:04:59 INFO - 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'), 06:04:59 INFO - 'enabled': True, 06:04:59 INFO - 'halt_on_failure': False, 06:04:59 INFO - 'name': 'check_screen_resolution'},), 06:04:59 INFO - 'run_cmd_checks_enabled': True, 06:04:59 INFO - 'sps_profile': False, 06:04:59 INFO - 'sps_profile_interval': 0, 06:04:59 INFO - 'suite': 'dromaeojs', 06:04:59 INFO - 'system_bits': '32', 06:04:59 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:04:59 INFO - 'title': 't-yosemite-r7-0309', 06:04:59 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:04:59 INFO - 'use_talos_json': True, 06:04:59 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:04:59 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:04:59 INFO - 'work_dir': 'build'} 06:04:59 INFO - [mozharness: 2016-10-06 13:04:59.132732Z] Running clobber step. 06:04:59 INFO - Running pre-action listener: _resource_record_pre_action 06:04:59 INFO - Running main action method: clobber 06:04:59 INFO - rmtree: /builds/slave/test/build 06:04:59 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:05:01 INFO - Running post-action listener: _resource_record_post_action 06:05:01 INFO - [mozharness: 2016-10-06 13:05:01.343902Z] Finished clobber step (success) 06:05:01 INFO - [mozharness: 2016-10-06 13:05:01.344052Z] Running read-buildbot-config step. 06:05:01 INFO - Running pre-action listener: _resource_record_pre_action 06:05:01 INFO - Running main action method: read_buildbot_config 06:05:01 INFO - Using buildbot properties: 06:05:01 INFO - { 06:05:01 INFO - "project": "", 06:05:01 INFO - "product": "firefox", 06:05:01 INFO - "script_repo_revision": "production", 06:05:01 INFO - "builddir": "mozilla-central_yosemite_r7_test-dromaeojs", 06:05:01 INFO - "repository": "", 06:05:01 INFO - "buildername": "Rev7 MacOSX Yosemite 10.10.5 mozilla-central talos dromaeojs", 06:05:01 INFO - "buildid": "20161006030208", 06:05:01 INFO - "stage_platform": "macosx64", 06:05:01 INFO - "basedir": "/builds/slave/test", 06:05:01 INFO - "nightly_build": "True", 06:05:01 INFO - "buildnumber": 42, 06:05:01 INFO - "slavename": "t-yosemite-r7-0309", 06:05:01 INFO - "master": "http://buildbot-master134.bb.releng.scl3.mozilla.com:8201/", 06:05:01 INFO - "platform": "yosemite_r7", 06:05:01 INFO - "scheduler": "tests-mozilla-central-macosx64-talos", 06:05:01 INFO - "branch": "mozilla-central", 06:05:01 INFO - "repo_path": "mozilla-central", 06:05:01 INFO - "revision": "777fb63db8de8d78b64b8141d1a998397275dd03", 06:05:01 INFO - "pgo_build": "False", 06:05:01 INFO - "builduid": "f72f9a2146e041f7833d5c7dffd4dbed", 06:05:01 INFO - "slavebuilddir": "test" 06:05:01 INFO - } 06:05:01 INFO - Found installer url https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg. 06:05:01 INFO - Running post-action listener: _resource_record_post_action 06:05:01 INFO - [mozharness: 2016-10-06 13:05:01.347466Z] Finished read-buildbot-config step (success) 06:05:01 INFO - [mozharness: 2016-10-06 13:05:01.347597Z] Running download-and-extract step. 06:05:01 INFO - Running pre-action listener: _resource_record_pre_action 06:05:01 INFO - Running main action method: download_and_extract 06:05:01 INFO - mkdir: /builds/slave/test/build/tests 06:05:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:01 INFO - trying https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json 06:05:01 INFO - Downloading https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 06:05:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json'}, attempt #1 06:05:01 INFO - Downloaded 1199 bytes. 06:05:01 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.mac.test_packages.json 06:05:01 INFO - Using the following test package requirements: 06:05:01 INFO - {u'common': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 06:05:01 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 06:05:01 INFO - u'firefox-52.0a1.en-US.mac.cppunittest.tests.zip'], 06:05:01 INFO - u'gtest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 06:05:01 INFO - u'firefox-52.0a1.en-US.mac.gtest.tests.zip'], 06:05:01 INFO - u'jittest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 06:05:01 INFO - u'jsshell-mac.zip'], 06:05:01 INFO - u'mochitest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 06:05:01 INFO - u'firefox-52.0a1.en-US.mac.mochitest.tests.zip'], 06:05:01 INFO - u'mozbase': [u'firefox-52.0a1.en-US.mac.common.tests.zip'], 06:05:01 INFO - u'reftest': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 06:05:01 INFO - u'firefox-52.0a1.en-US.mac.reftest.tests.zip'], 06:05:01 INFO - u'talos': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 06:05:01 INFO - u'firefox-52.0a1.en-US.mac.talos.tests.zip'], 06:05:01 INFO - u'web-platform': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 06:05:01 INFO - u'firefox-52.0a1.en-US.mac.web-platform.tests.zip'], 06:05:01 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.mac.common.tests.zip', 06:05:01 INFO - u'firefox-52.0a1.en-US.mac.xpcshell.tests.zip']} 06:05:01 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip'] for test suite category: common 06:05:01 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 06:05:01 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 06:05:01 INFO - Fetch https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 06:05:02 INFO - Http code: 200 06:05:02 INFO - via: 1.1 11dd60d1f68e8258294f92935b53a91f.cloudfront.net (CloudFront) 06:05:02 INFO - x-amz-cf-id: 0k9KgJoKg67MOv1UKUhvdNDRjN6xZSropuIsnfEbdv6jwAlDz26UNg== 06:05:02 INFO - x-amz-version-id: IxJC4AoWjMMETj6cjw8vdbjgcbSGyrhf 06:05:02 INFO - Expected file size: 16478378 06:05:02 INFO - Obtained file size: 16478378 06:05:09 INFO - Downloading packages: [u'firefox-52.0a1.en-US.mac.common.tests.zip', u'firefox-52.0a1.en-US.mac.talos.tests.zip'] for test suite category: talos 06:05:09 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip 06:05:09 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip'}, attempt #1 06:05:09 INFO - Fetch https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.common.tests.zip into memory 06:05:10 INFO - Http code: 200 06:05:10 INFO - via: 1.1 0302e8c462515ae281b72d9c815a5698.cloudfront.net (CloudFront) 06:05:10 INFO - x-amz-cf-id: lMaJfXcRWdhleUkc3ltKOiQ_shSAGGCzEz7gfT79-bs_fyAUZ0_Rug== 06:05:10 INFO - x-amz-version-id: IxJC4AoWjMMETj6cjw8vdbjgcbSGyrhf 06:05:10 INFO - Expected file size: 16478378 06:05:10 INFO - Obtained file size: 16478378 06:05:16 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip 06:05:16 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip'}, attempt #1 06:05:16 INFO - Fetch https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.talos.tests.zip into memory 06:05:18 INFO - Http code: 200 06:05:18 INFO - via: 1.1 032d42677fbf05c24a4bb71369581429.cloudfront.net (CloudFront) 06:05:18 INFO - x-amz-cf-id: lp94yaCAmmyxYlz4IRcSytldsBNJmcZWTjf95fKOToF2mjx3ftAP6w== 06:05:18 INFO - x-amz-version-id: ASDCHZWP2zIgb8LilL9gw0eo7MnpJ7M6 06:05:18 INFO - Expected file size: 14409006 06:05:18 INFO - Obtained file size: 14409006 06:05:18 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:18 INFO - trying https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 06:05:18 INFO - Downloading https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg to /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg 06:05:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg'}, attempt #1 06:05:22 INFO - Downloaded 111808745 bytes. 06:05:22 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 06:05:22 INFO - mkdir: /builds/slave/test/properties 06:05:22 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:05:22 INFO - Writing to file /builds/slave/test/properties/build_url 06:05:22 INFO - Contents: 06:05:22 INFO - build_url:https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg 06:05:22 INFO - Running post-action listener: _resource_record_post_action 06:05:22 INFO - Running post-action listener: set_extra_try_arguments 06:05:22 INFO - [mozharness: 2016-10-06 13:05:22.731352Z] Finished download-and-extract step (success) 06:05:22 INFO - [mozharness: 2016-10-06 13:05:22.731516Z] Running populate-webroot step. 06:05:22 INFO - Running pre-action listener: _resource_record_pre_action 06:05:22 INFO - Running main action method: populate_webroot 06:05:22 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:05:22 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:05:22 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:05:22 INFO - '--tppagecycles', 06:05:22 INFO - '7'], 06:05:22 INFO - 'tests': ['tsvgm']}}, 06:05:22 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:05:22 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 06:05:22 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:05:22 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 06:05:22 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:05:22 INFO - 'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:05:22 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:05:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:05:22 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:05:22 INFO - 'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['damp', 'tps']}, 06:05:22 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:05:22 INFO - 'tests': ['damp', 'tps']}, 06:05:22 INFO - 'g3': {'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['dromaeo_dom']}, 06:05:22 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:05:22 INFO - 'g4': {'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['basic_compositor_video']}, 06:05:22 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 06:05:22 INFO - 'other': {'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['a11yr', 06:05:22 INFO - 'ts_paint', 06:05:22 INFO - 'tpaint', 06:05:22 INFO - 'sessionrestore', 06:05:22 INFO - 'sessionrestore_no_auto_restore', 06:05:22 INFO - 'tabpaint']}, 06:05:22 INFO - 'other-e10s': {'tests': ['a11yr', 06:05:22 INFO - 'ts_paint', 06:05:22 INFO - 'tpaint', 06:05:22 INFO - 'sessionrestore', 06:05:22 INFO - 'sessionrestore_no_auto_restore', 06:05:22 INFO - 'tabpaint']}, 06:05:22 INFO - 'other-e10s_l64': {'tests': ['a11yr', 06:05:22 INFO - 'ts_paint', 06:05:22 INFO - 'tpaint', 06:05:22 INFO - 'sessionrestore', 06:05:22 INFO - 'sessionrestore_no_auto_restore', 06:05:22 INFO - 'tabpaint']}, 06:05:22 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 06:05:22 INFO - 'ts_paint', 06:05:22 INFO - 'tpaint', 06:05:22 INFO - 'sessionrestore', 06:05:22 INFO - 'sessionrestore_no_auto_restore', 06:05:22 INFO - 'tabpaint']}, 06:05:22 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['a11yr', 06:05:22 INFO - 'ts_paint', 06:05:22 INFO - 'tpaint', 06:05:22 INFO - 'sessionrestore', 06:05:22 INFO - 'sessionrestore_no_auto_restore', 06:05:22 INFO - 'tabpaint']}, 06:05:22 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['a11yr', 06:05:22 INFO - 'ts_paint', 06:05:22 INFO - 'tpaint', 06:05:22 INFO - 'sessionrestore', 06:05:22 INFO - 'sessionrestore_no_auto_restore', 06:05:22 INFO - 'tabpaint']}, 06:05:22 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['tsvgx', 06:05:22 INFO - 'tsvgr_opacity', 06:05:22 INFO - 'tart', 06:05:22 INFO - 'tscrollx', 06:05:22 INFO - 'cart']}, 06:05:22 INFO - 'svgr-e10s': {'tests': ['tsvgx', 06:05:22 INFO - 'tsvgr_opacity', 06:05:22 INFO - 'tart', 06:05:22 INFO - 'tscrollx', 06:05:22 INFO - 'cart']}, 06:05:22 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:05:22 INFO - 'talos_options': ['--disable-e10s'], 06:05:22 INFO - 'tests': ['tp5o']}, 06:05:22 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:05:22 INFO - 'tests': ['tp5o']}, 06:05:22 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:05:22 INFO - 'talos_options': ['--disable-e10s', 06:05:22 INFO - '--xperf_path', 06:05:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:05:22 INFO - 'tests': ['tp5n']}, 06:05:22 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:05:22 INFO - 'talos_options': ['--xperf_path', 06:05:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:05:22 INFO - 'tests': ['tp5n']}}, 06:05:22 INFO - 'talos.zip': {'path': '', 06:05:22 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:05:22 INFO - Running post-action listener: _resource_record_post_action 06:05:22 INFO - [mozharness: 2016-10-06 13:05:22.750140Z] Finished populate-webroot step (success) 06:05:22 INFO - [mozharness: 2016-10-06 13:05:22.750268Z] Running create-virtualenv step. 06:05:22 INFO - Running pre-action listener: _resource_record_pre_action 06:05:22 INFO - Running main action method: create_virtualenv 06:05:22 INFO - Creating virtualenv /builds/slave/test/build/venv 06:05:22 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 06:05:22 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:05:22 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:05:22 INFO - Using real prefix '/tools/python27' 06:05:22 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:05:23 INFO - Installing distribute.............................................................................................................................................................................................done. 06:05:26 INFO - Installing pip.................done. 06:05:26 INFO - Return code: 0 06:05:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 06:05:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 06:05:26 INFO - Reading from file tmpfile_stdout 06:05:26 INFO - Output received: 06:05:26 INFO - pip 1.5.5 from /builds/slave/test/build/venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 06:05:26 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:05:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 06:05:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 06:05:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:26 INFO - 'HOME': '/Users/cltbld', 06:05:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:26 INFO - 'LOGNAME': 'cltbld', 06:05:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:26 INFO - 'MOZ_NO_REMOTE': '1', 06:05:26 INFO - 'NO_EM_RESTART': '1', 06:05:26 INFO - 'PAGER': '/bin/cat', 06:05:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:26 INFO - 'PWD': '/builds/slave/test', 06:05:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:26 INFO - 'SHELL': '/bin/bash', 06:05:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:26 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:26 INFO - 'USER': 'cltbld', 06:05:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:26 INFO - 'XPC_FLAGS': '0x0', 06:05:26 INFO - 'XPC_SERVICE_NAME': '0', 06:05:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:26 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 06:05:26 INFO - Cleaning up... 06:05:26 INFO - Return code: 0 06:05:26 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 06:05:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 06:05:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 06:05:26 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:26 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:26 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:26 INFO - 'HOME': '/Users/cltbld', 06:05:26 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:26 INFO - 'LOGNAME': 'cltbld', 06:05:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:26 INFO - 'MOZ_NO_REMOTE': '1', 06:05:26 INFO - 'NO_EM_RESTART': '1', 06:05:26 INFO - 'PAGER': '/bin/cat', 06:05:26 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:26 INFO - 'PWD': '/builds/slave/test', 06:05:26 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:26 INFO - 'SHELL': '/bin/bash', 06:05:26 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:26 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:26 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:26 INFO - 'USER': 'cltbld', 06:05:26 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:26 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:26 INFO - 'XPC_FLAGS': '0x0', 06:05:26 INFO - 'XPC_SERVICE_NAME': '0', 06:05:26 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:27 INFO - Downloading/unpacking psutil>=3.1.1 06:05:27 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 06:05:27 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 06:05:27 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 06:05:27 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 06:05:27 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 06:05:27 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 06:05:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:05:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:05:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:05:30 INFO - Installing collected packages: psutil 06:05:30 INFO - Running setup.py install for psutil 06:05:30 INFO - building 'psutil._psutil_osx' extension 06:05:30 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 06:05:31 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 06:05:31 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 06:05:31 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 06:05:31 INFO - building 'psutil._psutil_posix' extension 06:05:31 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 06:05:31 WARNING - psutil/_psutil_posix.c:403:11: warning: implicit declaration of function 'ioctl' is invalid in C99 [-Wimplicit-function-declaration] 06:05:31 INFO - ret = ioctl(sock, SIOCGIFFLAGS, &ifr); 06:05:31 INFO - ^ 06:05:31 INFO - 1 warning generated. 06:05:31 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 06:05:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:05:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:05:31 INFO - Successfully installed psutil 06:05:31 INFO - Cleaning up... 06:05:31 INFO - Return code: 0 06:05:31 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 06:05: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 06:05:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 06:05:31 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:31 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:31 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:31 INFO - 'HOME': '/Users/cltbld', 06:05:31 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:31 INFO - 'LOGNAME': 'cltbld', 06:05:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:31 INFO - 'MOZ_NO_REMOTE': '1', 06:05:31 INFO - 'NO_EM_RESTART': '1', 06:05:31 INFO - 'PAGER': '/bin/cat', 06:05:31 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:31 INFO - 'PWD': '/builds/slave/test', 06:05:31 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:31 INFO - 'SHELL': '/bin/bash', 06:05:31 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:31 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:31 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:31 INFO - 'USER': 'cltbld', 06:05:31 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:31 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:31 INFO - 'XPC_FLAGS': '0x0', 06:05:31 INFO - 'XPC_SERVICE_NAME': '0', 06:05:31 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:32 INFO - Downloading/unpacking mozsystemmonitor==0.3 06:05: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 06:05: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 06:05: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 06:05: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 06:05: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 06:05: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 06:05:34 INFO - Downloading mozsystemmonitor-0.3.tar.gz 06:05:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:05:34 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 06:05:34 INFO - Installing collected packages: mozsystemmonitor 06:05:34 INFO - Running setup.py install for mozsystemmonitor 06:05:34 INFO - Successfully installed mozsystemmonitor 06:05:34 INFO - Cleaning up... 06:05:34 INFO - Return code: 0 06:05:34 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 06:05:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 06:05:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 06:05:34 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:34 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:34 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:34 INFO - 'HOME': '/Users/cltbld', 06:05:34 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:34 INFO - 'LOGNAME': 'cltbld', 06:05:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:34 INFO - 'MOZ_NO_REMOTE': '1', 06:05:34 INFO - 'NO_EM_RESTART': '1', 06:05:34 INFO - 'PAGER': '/bin/cat', 06:05:34 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:34 INFO - 'PWD': '/builds/slave/test', 06:05:34 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:34 INFO - 'SHELL': '/bin/bash', 06:05:34 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:34 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:34 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:34 INFO - 'USER': 'cltbld', 06:05:34 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:34 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:34 INFO - 'XPC_FLAGS': '0x0', 06:05:34 INFO - 'XPC_SERVICE_NAME': '0', 06:05:34 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:35 INFO - Downloading/unpacking jsonschema==2.5.1 06:05:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:05:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:05:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:05:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:05:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:05:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:05:37 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:05:37 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 06:05:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:05:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:05:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:05:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:05:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:05:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:05:37 INFO - Downloading functools32-3.2.3-2.tar.gz 06:05:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:05:38 INFO - warning: no files found matching '*.txt' 06:05:38 INFO - no previously-included directories found matching 'build' 06:05:38 INFO - no previously-included directories found matching 'dist' 06:05:38 INFO - no previously-included directories found matching '.git*' 06:05:38 INFO - Installing collected packages: jsonschema, functools32 06:05:38 INFO - Running setup.py install for functools32 06:05:38 INFO - warning: no files found matching '*.txt' 06:05:38 INFO - no previously-included directories found matching 'build' 06:05:38 INFO - no previously-included directories found matching 'dist' 06:05:38 INFO - no previously-included directories found matching '.git*' 06:05:38 INFO - Successfully installed jsonschema functools32 06:05:38 INFO - Cleaning up... 06:05:38 INFO - Return code: 0 06:05:38 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 06:05:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 06:05:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 06:05:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:38 INFO - 'HOME': '/Users/cltbld', 06:05:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:38 INFO - 'LOGNAME': 'cltbld', 06:05:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:38 INFO - 'MOZ_NO_REMOTE': '1', 06:05:38 INFO - 'NO_EM_RESTART': '1', 06:05:38 INFO - 'PAGER': '/bin/cat', 06:05:38 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:38 INFO - 'PWD': '/builds/slave/test', 06:05:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:38 INFO - 'SHELL': '/bin/bash', 06:05:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:38 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:38 INFO - 'USER': 'cltbld', 06:05:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:38 INFO - 'XPC_FLAGS': '0x0', 06:05:38 INFO - 'XPC_SERVICE_NAME': '0', 06:05:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:38 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 06:05:38 INFO - Cleaning up... 06:05:38 INFO - Return code: 0 06:05:38 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:05:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:38 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 06:05:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 06:05:38 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:38 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:38 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:38 INFO - 'HOME': '/Users/cltbld', 06:05:38 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:38 INFO - 'LOGNAME': 'cltbld', 06:05:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:38 INFO - 'MOZ_NO_REMOTE': '1', 06:05:38 INFO - 'NO_EM_RESTART': '1', 06:05:38 INFO - 'PAGER': '/bin/cat', 06:05:38 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:38 INFO - 'PWD': '/builds/slave/test', 06:05:38 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:38 INFO - 'SHELL': '/bin/bash', 06:05:38 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:38 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:38 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:38 INFO - 'USER': 'cltbld', 06:05:38 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:38 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:38 INFO - 'XPC_FLAGS': '0x0', 06:05:38 INFO - 'XPC_SERVICE_NAME': '0', 06:05:38 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:38 INFO - Downloading/unpacking blobuploader==1.2.4 06:05:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:05:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:05:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:05:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:05:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:05:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:05:41 INFO - Downloading blobuploader-1.2.4.tar.gz 06:05:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:05:41 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:05:41 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 06:05:41 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 06:05:41 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 06:05:41 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 06:05:41 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 06:05:41 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 06:05:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:05:42 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:05:42 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 06:05:42 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 06:05:42 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 06:05:42 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 06:05:42 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 06:05:42 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 06:05:42 INFO - Downloading docopt-0.6.1.tar.gz 06:05:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:05:42 INFO - Installing collected packages: blobuploader, requests, docopt 06:05:42 INFO - Running setup.py install for blobuploader 06:05:42 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:05:42 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:05:42 INFO - Running setup.py install for requests 06:05:43 INFO - Running setup.py install for docopt 06:05:43 INFO - Successfully installed blobuploader requests docopt 06:05:43 INFO - Cleaning up... 06:05:43 INFO - Return code: 0 06:05:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:05:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:05:43 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:43 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:43 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:43 INFO - 'HOME': '/Users/cltbld', 06:05:43 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:43 INFO - 'LOGNAME': 'cltbld', 06:05:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:43 INFO - 'MOZ_NO_REMOTE': '1', 06:05:43 INFO - 'NO_EM_RESTART': '1', 06:05:43 INFO - 'PAGER': '/bin/cat', 06:05:43 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:43 INFO - 'PWD': '/builds/slave/test', 06:05:43 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:43 INFO - 'SHELL': '/bin/bash', 06:05:43 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:43 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:43 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:43 INFO - 'USER': 'cltbld', 06:05:43 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:43 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:43 INFO - 'XPC_FLAGS': '0x0', 06:05:43 INFO - 'XPC_SERVICE_NAME': '0', 06:05:43 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:05:43 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-3c_FqD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:05:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:05:43 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-q26VPQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:05:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:05:43 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-sI2Msm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-kyFHQU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-1VVsvt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-CAw3g6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-FurlEE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-XjWLfn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-AgaMpE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-SWQeWO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-kOn_kQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-wba42l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:05:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:05:44 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-pEWKgC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:05:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:05:45 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-BfUghl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:05:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:05:45 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-1gjgKj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:05:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:05:45 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-mAKCDQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:05:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:05:45 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-Dwf7uK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:05:45 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:05:45 INFO - Running setup.py install for manifestparser 06:05:45 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:05:45 INFO - Running setup.py install for mozcrash 06:05:45 INFO - Running setup.py install for mozdebug 06:05:45 INFO - Running setup.py install for mozdevice 06:05:46 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:05:46 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:05:46 INFO - Running setup.py install for mozfile 06:05:46 INFO - Running setup.py install for mozhttpd 06:05:46 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:05:46 INFO - Running setup.py install for mozinfo 06:05:46 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:05:46 INFO - Running setup.py install for mozInstall 06:05:46 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:05:46 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:05:46 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:05:46 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:05:46 INFO - Running setup.py install for mozleak 06:05:46 INFO - Running setup.py install for mozlog 06:05:46 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:05:46 INFO - Running setup.py install for moznetwork 06:05:47 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:05:47 INFO - Running setup.py install for mozprocess 06:05:47 INFO - Running setup.py install for mozprofile 06:05:47 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:05:47 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:05:47 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:05:47 INFO - Running setup.py install for mozrunner 06:05:47 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:05:47 INFO - Running setup.py install for mozscreenshot 06:05:47 INFO - Running setup.py install for moztest 06:05:47 INFO - Running setup.py install for mozversion 06:05:48 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:05:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:05:48 INFO - Cleaning up... 06:05:48 INFO - Return code: 0 06:05:48 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:05:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:48 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:48 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:05:48 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:05:48 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:48 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:48 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:48 INFO - 'HOME': '/Users/cltbld', 06:05:48 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:48 INFO - 'LOGNAME': 'cltbld', 06:05:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:48 INFO - 'MOZ_NO_REMOTE': '1', 06:05:48 INFO - 'NO_EM_RESTART': '1', 06:05:48 INFO - 'PAGER': '/bin/cat', 06:05:48 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:48 INFO - 'PWD': '/builds/slave/test', 06:05:48 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:48 INFO - 'SHELL': '/bin/bash', 06:05:48 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:48 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:48 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:48 INFO - 'USER': 'cltbld', 06:05:48 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:48 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:48 INFO - 'XPC_FLAGS': '0x0', 06:05:48 INFO - 'XPC_SERVICE_NAME': '0', 06:05:48 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:05:48 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-WVmcv5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:05:48 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)) 06:05:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:05:48 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-036Lme-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:05:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:05:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:05:48 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-A4Ntrn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:05:48 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)) 06:05:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:05:48 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-Qosl08-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:05:48 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:05:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:05:48 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-QhrRTo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:05:48 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)) 06:05:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:05:48 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-6k9mhz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:05:48 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)) 06:05:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:05:48 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-viREHp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:05:49 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)) 06:05:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:05:49 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-xJuSHe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:05:49 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)) 06:05:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:05:49 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-GRrqs3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:05:49 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)) 06:05:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:05:49 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-S4Z6vK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:05:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 06:05:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:05:49 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-GlAX3X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:05:49 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)) 06:05:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:05:49 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-bLVnLr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:05:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 06:05:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:05:49 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-j7Q4Vi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:05:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 06:05:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:05:49 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-fiO1tm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:05:49 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 06:05:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:05:49 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-2Oyut4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:05:49 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)) 06:05:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:05:49 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-wMwlEe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:05:50 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)) 06:05:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:05:50 INFO - Running setup.py (path:/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/pip-_SDihz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:05:50 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)) 06:05:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:05:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:05:50 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)) 06:05:50 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:05:50 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:05:50 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:05:50 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 06:05:50 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 06:05:50 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 06:05:50 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 06:05:50 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 06:05:50 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 06:05:52 INFO - Downloading blessings-1.6.tar.gz 06:05:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:05:52 INFO - Installing collected packages: blessings 06:05:52 INFO - Running setup.py install for blessings 06:05:52 INFO - Successfully installed blessings 06:05:52 INFO - Cleaning up... 06:05:52 INFO - Return code: 0 06:05:52 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:05:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:05:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:05:53 INFO - Reading from file tmpfile_stdout 06:05:53 INFO - Current package versions: 06:05:53 INFO - blessings == 1.6 06:05:53 INFO - blobuploader == 1.2.4 06:05:53 INFO - docopt == 0.6.1 06:05:53 INFO - functools32 == 3.2.3-2 06:05:53 INFO - jsonschema == 2.5.1 06:05:53 INFO - manifestparser == 1.1 06:05:53 INFO - mozInstall == 1.12 06:05:53 INFO - mozcrash == 0.17 06:05:53 INFO - mozdebug == 0.1 06:05:53 INFO - mozdevice == 0.48 06:05:53 INFO - mozfile == 1.2 06:05:53 INFO - mozhttpd == 0.7 06:05:53 INFO - mozinfo == 0.9 06:05:53 INFO - mozleak == 0.1 06:05:53 INFO - mozlog == 3.4 06:05:53 INFO - moznetwork == 0.27 06:05:53 INFO - mozprocess == 0.23 06:05:53 INFO - mozprofile == 0.28 06:05:53 INFO - mozrunner == 6.12 06:05:53 INFO - mozscreenshot == 0.1 06:05:53 INFO - mozsystemmonitor == 0.3 06:05:53 INFO - moztest == 0.7 06:05:53 INFO - mozversion == 1.4 06:05:53 INFO - psutil == 3.1.1 06:05:53 INFO - requests == 1.2.3 06:05:53 INFO - wsgiref == 0.1.2 06:05:53 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:05:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 06:05:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:05:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:54 INFO - 'HOME': '/Users/cltbld', 06:05:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:54 INFO - 'LOGNAME': 'cltbld', 06:05:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:54 INFO - 'MOZ_NO_REMOTE': '1', 06:05:54 INFO - 'NO_EM_RESTART': '1', 06:05:54 INFO - 'PAGER': '/bin/cat', 06:05:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:54 INFO - 'PWD': '/builds/slave/test', 06:05:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:54 INFO - 'SHELL': '/bin/bash', 06:05:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:54 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:54 INFO - 'USER': 'cltbld', 06:05:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:54 INFO - 'XPC_FLAGS': '0x0', 06:05:54 INFO - 'XPC_SERVICE_NAME': '0', 06:05:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 06:05:54 INFO - Cleaning up... 06:05:54 INFO - Return code: 0 06:05:54 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06:05:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:05:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:05:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:05:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:05:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x108b55490>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108acb570>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f9bf3d68e70>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'XPC_SERVICE_NAME': '0', 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 'HOME': '/Users/cltbld', 'NO_EM_RESTART': '1', 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 'XPCOM_DEBUG_BREAK': 'warn', 'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners', 'SHELL': '/bin/bash', 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', '__CF_USER_TEXT_ENCODING': '0x1C:0:0', 'PWD': '/builds/slave/test', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'PAGER': '/bin/cat'}}, attempt #1 06:05:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 06:05:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 06:05:54 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:05:54 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:05:54 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:05:54 INFO - 'HOME': '/Users/cltbld', 06:05:54 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:05:54 INFO - 'LOGNAME': 'cltbld', 06:05:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:05:54 INFO - 'MOZ_NO_REMOTE': '1', 06:05:54 INFO - 'NO_EM_RESTART': '1', 06:05:54 INFO - 'PAGER': '/bin/cat', 06:05:54 INFO - 'PATH': '/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:05:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:05:54 INFO - 'PWD': '/builds/slave/test', 06:05:54 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:05:54 INFO - 'SHELL': '/bin/bash', 06:05:54 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:05:54 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:05:54 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:05:54 INFO - 'USER': 'cltbld', 06:05:54 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:05:54 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:05:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:05:54 INFO - 'XPC_FLAGS': '0x0', 06:05:54 INFO - 'XPC_SERVICE_NAME': '0', 06:05:54 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:05:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:05:54 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 06:05:54 INFO - Cleaning up... 06:05:54 INFO - Return code: 0 06:05:54 INFO - Running post-action listener: _resource_record_post_action 06:05:54 INFO - Running post-action listener: _start_resource_monitoring 06:05:54 INFO - Starting resource monitoring. 06:05:54 INFO - [mozharness: 2016-10-06 13:05:54.976944Z] Finished create-virtualenv step (success) 06:05:54 INFO - [mozharness: 2016-10-06 13:05:54.977826Z] Running install step. 06:05:54 INFO - Running pre-action listener: _resource_record_pre_action 06:05:54 INFO - Running main action method: install 06:05:54 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:05:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:05:55 INFO - Reading from file tmpfile_stdout 06:05:55 INFO - Detecting whether we're running mozinstall >=1.0... 06:05:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:05:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:05:55 INFO - Reading from file tmpfile_stdout 06:05:55 INFO - Output received: 06:05:55 INFO - Usage: mozinstall [options] installer 06:05:55 INFO - Options: 06:05:55 INFO - -h, --help show this help message and exit 06:05:55 INFO - -d DEST, --destination=DEST 06:05:55 INFO - Directory to install application into. [default: 06:05:55 INFO - "/builds/slave/test"] 06:05:55 INFO - --app=APP Application being installed. [default: firefox] 06:05:55 INFO - mkdir: /builds/slave/test/build/application 06:05:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg', '--destination', '/builds/slave/test/build/application'] 06:05:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.mac.dmg --destination /builds/slave/test/build/application 06:06:29 INFO - Reading from file tmpfile_stdout 06:06:29 INFO - Output received: 06:06:29 INFO - /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox 06:06:29 INFO - Running post-action listener: _resource_record_post_action 06:06:29 INFO - [mozharness: 2016-10-06 13:06:29.360176Z] Finished install step (success) 06:06:29 INFO - [mozharness: 2016-10-06 13:06:29.360329Z] Running run-tests step. 06:06:29 INFO - Running pre-action listener: _resource_record_pre_action 06:06:29 INFO - Running main action method: run_tests 06:06:29 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 06:06:29 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 06:06:29 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 06:06:29 INFO - 2016-10-06 06:06:29.375 screenresolution[1643:7661] starting screenresolution argv=screenresolution get 06:06:29 INFO - 2016-10-06 06:06:29.377 screenresolution[1643:7661] Display 0: 1600x1200x32@60 06:06:29 INFO - 2016-10-06 06:06:29.384 screenresolution[1644:7663] starting screenresolution argv=screenresolution list 06:06:29 INFO - Available Modes on Display 0 06:06:29 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 06:06:29 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 06:06:29 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 06:06:29 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 06:06:29 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 06:06:29 INFO - Intel Iris: 06:06:29 INFO - Chipset Model: Intel Iris 06:06:29 INFO - Type: GPU 06:06:29 INFO - Bus: Built-In 06:06:29 INFO - VRAM (Dynamic, Max): 1536 MB 06:06:29 INFO - Vendor: Intel (0x8086) 06:06:29 INFO - Device ID: 0x0a2e 06:06:29 INFO - Revision ID: 0x0009 06:06:29 INFO - Displays: 06:06:29 INFO - Display: 06:06:29 INFO - Resolution: 1600 x 1200 @ 60 Hz 06:06:29 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 06:06:29 INFO - Display Serial Number: 1600x1200 60 06:06:29 INFO - Main Display: Yes 06:06:29 INFO - Mirror: Off 06:06:29 INFO - Online: Yes 06:06:29 INFO - Rotation: Supported 06:06:29 INFO - Return code: 0 06:06:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:06:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:06:29 INFO - Python 2.7.3 06:06:29 INFO - Return code: 0 06:06:29 INFO - grabbing minidump binary from tooltool 06:06:29 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 06:06:29 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x108969d30>, '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 0x10878fdb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x108961b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:06:29 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 06:06:29 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 06:06:29 INFO - Calling ['/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'] with output_timeout 600 06:06:29 INFO - INFO - File macosx64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:06:29 INFO - Return code: 0 06:06:29 INFO - Chmoding /builds/slave/test/build/macosx64-minidump_stackwalk to 0755 06:06:29 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:06:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:06:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/macosx64-minidump_stackwalk 06:06:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:06:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0309', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 06:06:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip --title t-yosemite-r7-0309 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 06:06:29 INFO - Using env: {'Apple_PubSub_Socket_Render': '/private/tmp/com.apple.launchd.GYLV6Pnx1e/Render', 06:06:29 INFO - 'GIT_SHARE_BASE_DIR': '/builds/git-shared', 06:06:29 INFO - 'HG_SHARE_BASE_DIR': '/builds/hg-shared', 06:06:29 INFO - 'HOME': '/Users/cltbld', 06:06:29 INFO - 'IDLEIZER_DISABLE_SHUTDOWN': 'true', 06:06:29 INFO - 'LOGNAME': 'cltbld', 06:06:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:06:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/macosx64-minidump_stackwalk', 06:06:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:06:29 INFO - 'MOZ_NO_REMOTE': '1', 06:06:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:06:29 INFO - 'NO_EM_RESTART': '1', 06:06:29 INFO - 'PAGER': '/bin/cat', 06:06:29 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/bin/X11', 06:06:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:06:29 INFO - 'PWD': '/builds/slave/test', 06:06:29 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:06:29 INFO - 'RUNNER_CONFIG_CMD': '/opt/runner/bin/python2.7 /opt/runner/bin/runner -c /opt/runner/runner.cfg', 06:06:29 INFO - 'SHELL': '/bin/bash', 06:06:29 INFO - 'SSH_AUTH_SOCK': '/private/tmp/com.apple.launchd.dFvWoYjX8t/Listeners', 06:06:29 INFO - 'TMPDIR': '/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/', 06:06:29 INFO - 'TWISTD_LOG_PATH': '/builds/slave/twistd.log', 06:06:29 INFO - 'USER': 'cltbld', 06:06:29 INFO - 'VERSIONER_PYTHON_PREFER_32_BIT': 'no', 06:06:29 INFO - 'VERSIONER_PYTHON_VERSION': '2.7', 06:06:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:06:29 INFO - 'XPC_FLAGS': '0x0', 06:06:29 INFO - 'XPC_SERVICE_NAME': '0', 06:06:29 INFO - '__CF_USER_TEXT_ENCODING': '0x1C:0:0'} 06:06:29 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.crashreporter-symbols.zip', '--title', 't-yosemite-r7-0309', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 06:06:29 INFO - mozversion application_buildid: 20161006030208 06:06:29 INFO - mozversion application_changeset: 777fb63db8de8d78b64b8141d1a998397275dd03 06:06:29 INFO - mozversion application_display_name: Nightly 06:06:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:06:29 INFO - mozversion application_name: Firefox 06:06:29 INFO - mozversion application_remotingname: firefox 06:06:29 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 06:06:29 INFO - mozversion application_vendor: Mozilla 06:06:29 INFO - mozversion application_version: 52.0a1 06:06:29 INFO - mozversion platform_buildid: 20161006030208 06:06:29 INFO - mozversion platform_changeset: 777fb63db8de8d78b64b8141d1a998397275dd03 06:06:29 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 06:06:29 INFO - mozversion platform_version: 52.0a1 06:06:29 INFO - using testdate: 1475759189 06:06:29 INFO - actual date: 1475759189 06:06:29 INFO - starting webserver on 'localhost:49280' 06:06:29 INFO - SUITE-START | Running 2 tests 06:06:29 INFO - TEST-START | dromaeo_css 06:06:29 INFO - operating with platform_type : mac_ 06:06:29 INFO - Initialising browser for dromaeo_css test... 06:06:30 INFO - TEST-INFO | started process 1654 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/tmpwCsK3L/profile http://localhost:49280/getInfo.html) 06:06:32 INFO - PROCESS | 1654 | __metrics Screen width/height:1600/1200 06:06:32 INFO - PROCESS | 1654 | colorDepth:24 06:06:32 INFO - PROCESS | 1654 | Browser inner width/height: 1024/689 06:06:32 INFO - PROCESS | 1654 | __metrics 06:06:32 INFO - PROCESS | 1654 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 06:06:32 INFO - PROCESS | 1654 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:06:33 INFO - TEST-INFO | 1654: exit 0 06:06:33 INFO - Browser initialized. 06:06:33 INFO - Running cycle 1/1 for dromaeo_css test... 06:06:33 INFO - TEST-INFO | started process 1660 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/tmpwCsK3L/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:06:45 INFO - PROCESS | 1660 | RSS: Main: 255791104 06:06:45 INFO - PROCESS | 1660 | 06:07:37 INFO - PROCESS | 1660 | 1475759257298 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] 06:09:50 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49280/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49280/tests/dromaeo/cssquery-ext.html) 06:09:52 INFO - PROCESS | 1660 | RSS: Main: 396578816 06:09:52 INFO - PROCESS | 1660 | 06:12:55 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49280/tests/dromaeo/cssquery-ext.html (next: http://localhost:49280/tests/dromaeo/cssquery-jquery.html) 06:12:55 INFO - PROCESS | 1660 | RSS: Main: 390438912 06:12:55 INFO - PROCESS | 1660 | 06:15:57 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49280/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49280/tests/dromaeo/cssquery-mootools.html) 06:15:58 INFO - PROCESS | 1660 | RSS: Main: 382537728 06:15:58 INFO - PROCESS | 1660 | 06:19:00 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49280/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49280/tests/dromaeo/cssquery-prototype.html) 06:19:01 INFO - PROCESS | 1660 | RSS: Main: 356327424 06:19:01 INFO - PROCESS | 1660 | 06:22:04 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49280/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49280/tests/dromaeo/cssquery-yui.html) 06:22:05 INFO - PROCESS | 1660 | RSS: Main: 345067520 06:22:05 INFO - PROCESS | 1660 | 06:25:08 INFO - PROCESS | 1660 | Cycle 1(1): loaded http://localhost:49280/tests/dromaeo/cssquery-yui.html (next: http://localhost:49280/tests/dromaeo/cssquery-dojo.html) 06:25:08 INFO - PROCESS | 1660 | RSS: Main: 568905728 06:25:08 INFO - PROCESS | 1660 | 06:25:08 INFO - PROCESS | 1660 | __start_tp_report 06:25:08 INFO - PROCESS | 1660 | _x_x_mozilla_page_load 06:25:08 INFO - PROCESS | 1660 | _x_x_mozilla_page_load_details 06:25:08 INFO - PROCESS | 1660 | |i|pagename|runs| 06:25:08 INFO - PROCESS | 1660 | |0;dojo.html;3297.9010629681106;3308.387948229578;3312.2547426828964;3354.85934782174;3374.510695949087;5503.944960550393;5594.328680558334;5626.54987600992;5640.182173584828;5672.432756724331;4597.977010114953;5603.215549823028;5624.465675760796;5627.015272327347;5629.8592535186535;5084.872878178047;5114.130597798365;5118.513741194581;5150.072986862363;5204.531592156705;5122.487751224867;5219.556337711299;5225.634205605609;5226.111561034614;5238.109521381355;5104.438511763703;5133.3326667533165;5171.87070323243;5203.349581302337;5224.50367215114;5189.506996835314;5214.791408343662;5219.164933610642;5227.712475813829;5288.524032837063;5021.698698078127;5033.496650334974;5148.433672296082;5150.330457040598;5161.045206636784;4651.906961860744;5504.146857237135;5546.889062218733;5554.444555544454;5577.944220557823;6117.418845209698;6124.203853499062;6170.537209709245;6185.072239164117;6188.412100850412;6064.36324185963;6161.599496032743;6254.968725156391;6256.937430625727;6283.151774510474;4789.976050119727;5645.5483561315405;5672;5693.857653558612;5719.799807006735;6258.374162583706;6282.403171698681;6291.213598300213;6296.275928268216;6299.811005669837;6040;6047.425494578008;6072.787452439144;6087.482563982111;6088.391160883964;5957.136215248851;6015.639061656227;6100.75596976116;6107.450329470369;6162.815115546541;5100.872478188075;6096.847578810565;6117.996333785;6124.716609781064;6128.442013630915;6112.419320164578;6113.867421735435;6138.058862615638;6143.938560614426;6145.877082458326;4786.521347865255;4797.992421591435;4826.710397376099;4848;4852.344933434012;4387.912241755147;4409.36064270679;4422.624076953431;4425.822967081281;4432.601065904019;4460.30865215892;5649.689267090267;5698.686572238484;5732.398098199712;5739.225204597409;6173.135760993465;6183.103449999725;6205.441510264008;6213.409726076015;6221.09794079865;5629.634073785191;5679.744411501492;5715.999700052557;5720.056190728566;5730.455606717355;5188.63679542436;5232.3459567554055;5235.110031294689;5269.894602107936;5331.573474122061;6164.845878852975;6191.19514463117;6219.595726277777;6244.469220116341;6245.250569931637;6188.535859810622;6207.037909124093;6216;6225.190725205694;6233.5636505446;5350.732463376893;6193.566450348432;6253.530985176221;6257.09272155544;6262.624242545462;5924.822255332347;6011.579189456696;6017.488513476228;6041.577089603686;6052.788152414644;6057.878842423039;6164.753409863734;6187.071939208975;6195.101710252078;6221.377862213742;5908.291005079418;5976.372480889618;6025.849353766191;6029.071934401789;6049.606775559574;4904.2643603459765;5842.503387212135;5923.259592550931;5993.3706960768495;6005.6396616203165;5798.681072540882;5807.82576522705;5845.2108965290845;5864.530837533072;5904.881902361843;6029.788957386646;6045.758169673164;6050.90923636137;6066.120412540069;6090.543209259412;4888.5111488850835;5768.682722450306;5857.619254748428;5873.9412605873395;5877 06:25:08 INFO - PROCESS | 1660 | |1;ext.html;475.62663309302184;478.0916259107696;492.2296605811904;521.8904030153667;525.2934802690385;30680.539791903113;38960.41559376608;39938.600613993854;40132.9966750831;40203.59796402035;41537.37693934586;41974.58025419745;42113.15773684524;42130.36804447936;42144;9675.661351852668;9853.70438886831;9874.407535547854;9878.555465004092;9903.702888913343;8793.076726943675;9028.77428064297;11850.170488065838;12146.514139434412;12192.207506512093;11939.104567157454;12006.579769708062;12025.458854351575;12030.458629361656;12041.397930103503;12112.818307725347;12215.2670839749;12225.755484890342;12232.877671223263;12295.262284262973;8622.525761083138;8847.867281990775;11538.192326537146;11863.050955923505;11914.761704765857;39557.80221098876;39760.20479590421;39762.60237397618;39810.80567582977;39903;3191.5372271020574;3251.3009702913987;3356.7985920844585;3459.39460594395;3577.7853328800097;30151.69848301511;30373.24066898323;30558;31077.533836992465;31755.682443175734;3050.1916991997136;3077.5999120114466;3081.8613162407746;3197.776155669104;3212.0524445288697;441543;441719;446690;446926.76536617434;449850;56227.15659265114;56632.433675662716;56663.15005274924;56714.43285567174;56860.71569642208;34337.364455798146;35017.474737878954;35191.29617407689;35345.64654353423;35814.92555223347;15708.842911570966;15882.76175857363;15899.443519476763;15900.284487198103;15946;11146.996770290712;12086.69783255408;12195.268283902995;12199.93900030512;12202.938985305016;16042.518724438285;16455.012699238083;16456.83543164577;16457.60110390606;16474.670506589802;6778.762743303961;7597.581088510193;7875.763727088197;8007.199280071946;8059.879101813477;812.69600682067;833.3541505333416;869.9478031318141;926.3515539122641;1051.4112097225425;25847.095351662603;28276.575851362246;29457.263568410963;29924.70075299219;30160.396792064035;930.5765876526165;1093.7593729379523;1107.1364335818075;1143.3768596115137;1181.1731787748438;14107.647308817157;15438.073715577102;15890.920545397199;16588.336466541205;16999.575010624587;660230;660264;660718;662358;664466;57106;57420.42579574151;57517.424825752045;57668.42331576715;57676.71161644165;1167.9299242045504;1201.1171788735273;1242.782513060229;1328.5018118205674;1330.4944121233868;28514.144575661932;29415.26461838471;29646.851765741034;30245.395092098475;30245.546316805707;47640.52359476499;48279.75860120677;48421.273680895516;48461.75769121132;48473.27290090581;567034;570822;571276;572618;573004;24778.628320575568;25511.87244063842;25639.487210256062;25683.35791605225;25714.485710286062;43619.34570981501;44280.778596106815;44745.77627111843;44827.551724482335;45420.31869522026;36614.81692591627;36897.70858019956;37083.07292317713;37597.62402375941;37692.43461348137;36258.91223263306;36429.81785091058;37397.43903841499;37693.4345984805;37795.433068503444;35400.64599354076;35810.8209458951;36355.63644363522;36615.45076823796;37087;30703.385932281675;31336.05991820249;31545.143563813268;34726.65273347234;35550.64449355473;24915.538852128226;25050.62424063604;25063.87468062648;25448.363790905376;25846.966121354933 06:25:08 INFO - PROCESS | 1660 | |2;jquery.html;352.12145696487266;369.75041846753436;371.34086995582857;378.94315852622105;399.9300122478567;14945.476908308212;15075.020123691953;16094.436694715672;20265.189392424323;20759.584808303825;19657.606847863033;19869.701954470693;20172.193112275527;20782.584348313023;21016.684749728767;5861.560382971273;5947.553933454987;6118;6171.969140154293;6177.25872895251;5904.940950590503;6068.423499767537;6090.543209259301;6098.969505152468;6104.114903339013;4154.771487568182;4392.099619577994;6430.356964303555;6743.49423793215;6803.387695107439;5741.397153298885;6074.787382441594;6810.659467026654;6826.351496607815;6827.795166144999;5985;5989.251343582052;5990.341062483123;5996.8500787480225;6001.5198784097165;13126.474941002349;18123.093845307812;22061.889690551605;24744.752552474423;24968.375790605198;2128.3934078787624;2152.1929276521305;2175.2712841198218;2329.266281121458;2421.5520128776234;9750.268729845218;9888.357256778287;10005.749856253578;10406.635767748168;10471.581136754521;1865.3378050792044;1915.6934890417606;1919.7504324437873;1921.8366438852715;1937.2347922570507;104428;108689;117094.41452792767;118938.40530797378;122067;11385.430728463543;11488.368139752227;11514.36670983104;11515.424228788526;11694.356810375511;14441.49454769078;14518.419263229564;14525.055871368539;14540.709185816224;14542.054766440147;8242.587870606445;8506;8531.658733650584;8632.266257368068;8652.697155599524;8400.243978042006;8420;8440.66237350499;8594.31245500371;8604.956975215084;4419.204543182193;4529.38853254813;4564.863054108382;4610.423697037871;4662.883427914329;1840.1995132117572;1923.1634239106033;1923.4614307993784;1923.923043078289;1926.489480287725;913.4656226107801;919.4023884475145;977.6627063663025;981.8723565936383;990.1979396688705;19700.211991520464;21316.893415532824;21370;21397.76529070692;21623.351299461043;888.0852721696663;934.9859752103724;941.8493041113389;966.9419834809934;974.6247694637616;8899.955500222586;10488.947555262328;11264.493097810455;11320.377379244055;11358.432078396047;575501;585039.1496085069;591759;603948.960510398;606576;111905.44047279874;119967.80032199566;120175;135903;142161;870.3776799588325;950.5199874063553;1012.2205901455837;1016.1565900302732;1017.6082208349839;18810.905945470186;19616.607667846278;19748.111334989673;19829.20683172657;19862.304819331253;49302.75348623234;55841;55921.72039139778;56573.585660357174;57110.428895712175;58401.70799145977;71605;80041.59979200299;81023.78464322921;82707;6386.616802991835;8003.5197888126895;8213.79465513343;8254.174582541698;8348.749537513884;11369.829452558384;12624.55814046504;12871.356432178542;13360.398782054637;13440.865591343962;9548.85676714836;9592.328537002342;10743.785124297627;10783.299085559414;11294;10300;10325;11184.440777961232;11274.041706455044;11822.467988940347;5862.618929769551;7530.548167109991;10780.137588992706;11606.477708503306;11714.824277635671;7994.2405471480115;8222.17778222173;8401.495910245405;8402.117777633504;8580;8246.175382461706;10843.062248497068;11231.775364492501;11368.715782105513;11604.709882252673 06:25:08 INFO - PROCESS | 1660 | |3;mootools.html;1328.8272524571805;1488.493912069896;1518.9696206075878;1702.1149002518691;1886.9245230190784;7884.369250459964;8396.99236091669;8644.783880402993;8943.64225430982;8951.910480895189;8778.517181555011;8858.955705221464;8863.069377715343;8875.112488751138;8878.866816997734;2328.2433209207034;2354.176038386568;2355.316958082154;2355.5759963206615;2358.3514533503253;2300.804431623306;2344.7069116360453;2344.742078371378;2346.272655476808;2354.5761762882676;2311.087120587367;2337.544178885118;2339.450229196146;2350.576896158691;2360.1503458754833;2297.8046866016407;2320.9767902320928;2326.918557850467;2327.5112226432384;2329.0683726509365;2315.7568455312116;2320.7331156917003;2321.1759825261956;2323.790858822714;2328.0222306631254;8733;8804.295656347476;8857.335699822475;8981.01208867024;9008.009118996904;5245.79016839326;5391.973040134813;5398.13629819227;5398.91901621476;5402.432744561804;3523.594786599548;3536.098294934801;3581.623929487392;3605.963940360589;3623.275344930998;1035.4201647077662;1045.0490054050777;1045.63402809017;1049.3284298049255;1066.1950227578207;11657;11710.063194944469;11786.998105160987;11804.46879890407;11815.995640370578;4344.522102568715;4405.7797110144365;4532.478764942008;4568.360429539867;4573.794179261941;9172;9175.036621154815;9188.356815022884;9188.678396256098;9194.402363846328;5249.947500525022;5250.684958902478;5256.9737151314;5257.395399529103;5263.763130659129;4159.272127377697;4429.402030725811;4601.28680054592;4610.031893302377;4932.062908047459;3681.0981309579324;3758.4550240215017;3793.791341476245;3806.752561083576;3809.238152369537;1076.9461526923621;1134.6369161868122;1135.9261647992853;1141.0814294492848;1158.9942050289862;864.6325311742485;870.8606622940426;880.1418616848649;905.6678557273113;927.6567669962158;5567.777288908479;5791.160281759121;5842;5847.561432892465;5959.702014899238;838.1911455445525;911.166282851197;921.4747593871563;937.990620093804;957.3155194036298;3476.652334766554;3675.632436756303;3771.9811400943368;3850.4609354690365;3964.1873415949663;10563.366198028143;10962.945185274182;10967;10992.120630349553;11001.064909482784;10751.6236931707;10854.565817367375;10940.288881222696;10965.50655220517;10982.725431864268;7102.254263302279;8175.427720059539;8317.085120636724;8329.541875196923;8336.666533338599;4793.376861008047;5592.552595792408;5791.536677065909;5820.126980952891;5873.530117590497;9808.16630586408;10230.28388012832;10236.795264094528;10286.125679317342;10294.536745846304;9336.06639336061;9719.757006074904;10173.23700722434;10181;10333.638322658671;7145.39264162552;7365.926340736738;7377.483576149618;7508.849823003618;7647.655855486628;8165.632546535539;8265.752027439186;8287.792805179919;8363.372747044117;8369.330453563578;7543.434242431949;7571.796355798705;7602.201768814416;7614.923850761422;7642.006539149875;7378.557286562824;7424.517406368569;7441.702331906663;7508.0990281166605;7597.772066838003;6912.343327383891;6936.930630693629;6996.860062798817;7004.124484439445;7015.193252775792;4627.143978363879;4702.824293926518;4842.15262329098;4849.224124140121;4896.877578060435;4868.707877527359;4887.584555312838;5011.624128190328;5039.26930595069;5094.2867998479505 06:25:08 INFO - PROCESS | 1660 | |4;prototype.html;266.21201244316825;301.8701958157991;310.17957502406136;313.81014486235824;318.2378204200937;4252.723572967759;4960.1319769040365;5174.085588332322;5193.350831146112;5203.947960520393;4340.175366680329;4883.829065982683;5069.822556210534;5103.693778373291;5149.40781810092;3663.981680091596;3684.299983003221;3979.9801000994953;4007.2386246613196;4008.6793056555553;3673.8897833065053;3995.960040399588;3997.9600203998025;4007.939880901789;4053.817578208973;3764.3976963685814;3791.1187497501824;3914.921701565967;3916.667083297923;3921.5490218624795;3383.1372999885116;3811.2949104415634;3893.8637147699696;3915.530136383624;3936.783476908769;2728.8089833711647;2998.61018067652;3404.8209146146487;3433.725301975836;3435.5018522314126;4136.58634136587;4815.6388270879825;4974.328465657162;4983.6760610560195;5000.924986125211;4453.109378124355;4470.776461176961;4478.261086920655;4494.797734101973;4522.5025247222775;5330.974229792654;5382.165764306539;5410.48600382963;5412.5940554458175;5419.674819510842;2996.056242283674;3410.9488357674654;3728.6457786510236;3738;3754.7747135171976;5594.028239949641;5667.186500319858;5673.446948872983;5682.744276507526;5768.3654797972185;3781.565120011179;3784.735068545175;3786.8674596388996;3802.0914000789417;3823.9426408603895;3283.294091770233;3871.7483363581277;3871.825767840454;3887.8250478728523;3912.2785974171843;3696.77819330841;4115.73247738896;4335.7615331157085;4442.4899931538575;4496.3255511673515;4743.525647435298;5410.161424979135;5428.8099916503525;5436.776725236869;5507.944920550824;1173.4484792147678;1231.6982339326921;1267.9539380011527;1288.9806652900213;1313.9145955513052;802.9919700803034;816.6896579299828;824.6577670266892;852.6589364254224;858.3991206155716;3864.6908247340143;4057.6145266199665;4296.3555466680245;4343.457067866517;4345.9348109778375;4003.739756915791;4354.995053413135;4413.029133590605;4610.746408947473;4614.838480653161;3683.9447408288897;3729.8881033569037;4233.967695506174;4288.499025341168;4334;2188.33255856962;2309.595820731365;2400.819938504619;2417.456072383735;2432.477017441259;4454.977725111354;4635.605973492224;4672.976550208539;4675.545338697143;4704.270838020112;3897.6881849451975;4355.847545335898;4647.767611619405;4671.43942726875;4713.690291757083;3621.42878556228;4360.79481581044;4612.86161415158;4707.764611769467;4774.880627984328;4515.841945531891;4522.118186953512;4543.79552920126;4553.2259515881715;4606.516315786928;3939.7439166454087;4290.828366865415;4543.977280113579;4546.386237857979;4546.977265113654;3945.5265368156006;4086.5697006047644;4321.027768752006;4497.640188784955;4503.986603014296;3317.357907835637;3323.30210655765;3327.3345330933425;3367.7979321240805;3399.7960122392738;4233.330216489475;4608.976955115203;4611.907761844812;4616.699914505546;4668.5564871337165;3794.2790869734663;3916.6083391660604;4001.819918103634;4455.2575836297665;4473.261911784519;3575.6055138495485;3919.627635374635;4071.653909417733;4206.20082184384;4324.502682191463;3902.902427439223;3903.9414408783323;5037.596992240685;5255.605829562722;5274.762635681327;4359.476862776487;4802.046741254034;5467.097928841697;5480.424555421623;5484.8354549363585;4913.213885778258;5344.225087362233;5350;5354.437784032621;5362.946370536245 06:25:08 INFO - PROCESS | 1660 | |5;yui.html;679.3749750229788;733.8368685633271;776.9611519424031;792.2473650032471;824.3240542754943;15591.454299099534;15745.84254157458;15772.842271577281;15777.763333549992;15793.28930198141;14185;14275;14279.357428915699;14302.141871487718;14316.28418579072;685.547538624508;697.7627606613751;704.383664293743;704.5138854190618;860.3246451535546;834.6077343648506;855.6791203298762;855.8159995600945;867.405827008498;867.5271976772674;911.7902882337066;911.8632205169245;911.9589618467152;913.0914739833842;913.3378300731982;724.1527412926836;904.7014485219862;905.0135352465811;905.4702998745742;906.9501177435238;549.6674511920271;662.5163630549725;680.1430197950568;682.0689758479689;686.1251903822616;14068.71862562743;14086.366113524813;14154.716905661931;14303;14317.57047288583;13398.732025359535;13691.726165476734;13814.516491922734;13932.094413863168;14059.578212653636;10318.638847640372;12085.395730213455;12388.504459821595;12456.377181140906;12918.483260669656;4434.11317736454;4449.866504004885;4469.374287599739;4499.1451624191295;4523.2988886722615;111327;111492;111771;111932;111950;10650.89349106499;10891.400972946563;11056;11197.216194866282;11455.770884582262;21446.678299825515;21552;21556.4610884726;21558.461038474165;21615.35153945384;7659.315255218939;7798.415118866108;7856.135825059239;7874.763757087297;7957.482763620346;4264.104538046983;4300.333448315516;4329.891752706208;4410;4465.307877279027;3392.1010932103013;3415.316936612687;3491.790492570403;3500.754947153675;3504.299140171976;652.55952232244;658.7694306992514;667.1493845347125;675.1864003875319;715.7795957891886;561.4021067563033;663.8937769956784;669.4844969373555;669.902864084705;670.8926571748497;9119.498427586546;9183.862242066374;9341.667536884726;9561.426314421156;9720.465374404333;533.8211699080852;562.5724449418472;649.4674367018999;673.4208580620663;685.2496516314627;4142.337226043818;4467.195904737114;4655.494404787258;4714.66997310185;4821.2045012573235;123015;142468;145804;146526;149536;127057.36471317585;130768;131821;131858.34070829584;135171.45528264178;96141;97684.51157744166;100036;112447;118028.11550151935;9721;9815.55829987638;9822.459764713009;9925.751856203653;10019.899801001897;65308;65660;65957.0106448394;66898;68910.65544672245;80960.59519702363;94428.52785736302;99749;99992.50003749934;106143;12026.887846235653;12057.506715749607;12263.816042759187;12432.751344972869;12553.497860085494;14370.856291436952;14456;14702.485413010494;14852.554423367315;15205.923970380078;13536.932315338361;13584.184948903097;14153.292335382983;14257.572272831832;14261;13494.32528373597;13787;13791.931210318533;14038.649033774238;14175.787363189354;11761.235519691192;13191.34043297812;13481.056326057082;13482.000574081254;13484.662883427993;11346;11366.374849383032;11394.25937314072;11765.176437649625;11767.646970590897;8978.416402933788;9479.289053321167;10349.327293725884;10381.532831022772;11271.568172635158 06:25:08 INFO - PROCESS | 1660 | __end_tp_report 06:25:08 INFO - PROCESS | 1660 | __start_cc_report 06:25:08 INFO - PROCESS | 1660 | _x_x_mozilla_cycle_collect,1584 06:25:08 INFO - PROCESS | 1660 | __end_cc_report 06:25:08 INFO - PROCESS | 1660 | __startTimestamp1475760308965__endTimestamp 06:25:08 INFO - PROCESS | 1660 | 06:25:08 INFO - PROCESS | 1660 | ------- Summary: start ------- 06:25:08 INFO - PROCESS | 1660 | Number of tests: 6 06:25:08 INFO - PROCESS | 1660 | 06:25:08 INFO - PROCESS | 1660 | [#0] dojo.html Cycles:165 Average:5626.75 Median:5842.50 stddev:650.74 (11.1%) stddev-sans-first:626.56 06:25:08 INFO - PROCESS | 1660 | Values: 3297.9 3308.4 3312.3 3354.9 3374.5 5503.9 5594.3 5626.5 5640.2 5672.4 4598.0 5603.2 5624.5 5627.0 5629.9 5084.9 5114.1 5118.5 5150.1 5204.5 5122.5 5219.6 5225.6 5226.1 5238.1 5104.4 5133.3 5171.9 5203.3 5224.5 5189.5 5214.8 5219.2 5227.7 5288.5 5021.7 5033.5 5148.4 5150.3 5161.0 4651.9 5504.1 5546.9 5554.4 5577.9 6117.4 6124.2 6170.5 6185.1 6188.4 6064.4 6161.6 6255.0 6256.9 6283.2 4790.0 5645.5 5672.0 5693.9 5719.8 6258.4 6282.4 6291.2 6296.3 6299.8 6040.0 6047.4 6072.8 6087.5 6088.4 5957.1 6015.6 6100.8 6107.5 6162.8 5100.9 6096.8 6118.0 6124.7 6128.4 6112.4 6113.9 6138.1 6143.9 6145.9 4786.5 4798.0 4826.7 4848.0 4852.3 4387.9 4409.4 4422.6 4425.8 4432.6 4460.3 5649.7 5698.7 5732.4 5739.2 6173.1 6183.1 6205.4 6213.4 6221.1 5629.6 5679.7 5716.0 5720.1 5730.5 5188.6 5232.3 5235.1 5269.9 5331.6 6164.8 6191.2 6219.6 6244.5 6245.3 6188.5 6207.0 6216.0 6225.2 6233.6 5350.7 6193.6 6253.5 6257.1 6262.6 5924.8 6011.6 6017.5 6041.6 6052.8 6057.9 6164.8 6187.1 6195.1 6221.4 5908.3 5976.4 6025.8 6029.1 6049.6 4904.3 5842.5 5923.3 5993.4 6005.6 5798.7 5807.8 5845.2 5864.5 5904.9 6029.8 6045.8 6050.9 6066.1 6090.5 4888.5 5768.7 5857.6 5873.9 5877.0 06:25:08 INFO - PROCESS | 1660 | 06:25:08 INFO - PROCESS | 1660 | [#1] ext.html Cycles:180 Average:68228.14 Median:19564.21 stddev:151533.26 (774.5%) stddev-sans-first:151872.96 06:25:08 INFO - PROCESS | 1660 | Values: 475.6 478.1 492.2 521.9 525.3 30680.5 38960.4 39938.6 40133.0 40203.6 41537.4 41974.6 42113.2 42130.4 42144.0 9675.7 9853.7 9874.4 9878.6 9903.7 8793.1 9028.8 11850.2 12146.5 12192.2 11939.1 12006.6 12025.5 12030.5 12041.4 12112.8 12215.3 12225.8 12232.9 12295.3 8622.5 8847.9 11538.2 11863.1 11914.8 39557.8 39760.2 39762.6 39810.8 39903.0 3191.5 3251.3 3356.8 3459.4 3577.8 30151.7 30373.2 30558.0 31077.5 31755.7 3050.2 3077.6 3081.9 3197.8 3212.1 441543.0 441719.0 446690.0 446926.8 449850.0 56227.2 56632.4 56663.2 56714.4 56860.7 34337.4 35017.5 35191.3 35345.6 35814.9 15708.8 15882.8 15899.4 15900.3 15946.0 11147.0 12086.7 12195.3 12199.9 12202.9 16042.5 16455.0 16456.8 16457.6 16474.7 6778.8 7597.6 7875.8 8007.2 8059.9 812.7 833.4 869.9 926.4 1051.4 25847.1 28276.6 29457.3 29924.7 30160.4 930.6 1093.8 1107.1 1143.4 1181.2 14107.6 15438.1 15890.9 16588.3 16999.6 660230.0 660264.0 660718.0 662358.0 664466.0 57106.0 57420.4 57517.4 57668.4 57676.7 1167.9 1201.1 1242.8 1328.5 1330.5 28514.1 29415.3 29646.9 30245.4 30245.5 47640.5 48279.8 48421.3 48461.8 48473.3 567034.0 570822.0 571276.0 572618.0 573004.0 24778.6 25511.9 25639.5 25683.4 25714.5 43619.3 44280.8 44745.8 44827.6 45420.3 36614.8 36897.7 37083.1 37597.6 37692.4 36258.9 36429.8 37397.4 37693.4 37795.4 35400.6 35810.8 36355.6 36615.5 37087.0 30703.4 31336.1 31545.1 34726.7 35550.6 24915.5 25050.6 25063.9 25448.4 25847.0 06:25:08 INFO - PROCESS | 1660 | 06:25:08 INFO - PROCESS | 1660 | [#2] jquery.html Cycles:180 Average:34441.26 Median:360.94 stddev:98879.29 (27395.2%) stddev-sans-first:99123.54 06:25:08 INFO - PROCESS | 1660 | Values: 352.1 369.8 371.3 378.9 399.9 14945.5 15075.0 16094.4 20265.2 20759.6 19657.6 19869.7 20172.2 20782.6 21016.7 5861.6 5947.6 6118.0 6172.0 6177.3 5904.9 6068.4 6090.5 6099.0 6104.1 4154.8 4392.1 6430.4 6743.5 6803.4 5741.4 6074.8 6810.7 6826.4 6827.8 5985.0 5989.3 5990.3 5996.9 6001.5 13126.5 18123.1 22061.9 24744.8 24968.4 2128.4 2152.2 2175.3 2329.3 2421.6 9750.3 9888.4 10005.7 10406.6 10471.6 1865.3 1915.7 1919.8 1921.8 1937.2 104428.0 108689.0 117094.4 118938.4 122067.0 11385.4 11488.4 11514.4 11515.4 11694.4 14441.5 14518.4 14525.1 14540.7 14542.1 8242.6 8506.0 8531.7 8632.3 8652.7 8400.2 8420.0 8440.7 8594.3 8605.0 4419.2 4529.4 4564.9 4610.4 4662.9 1840.2 1923.2 1923.5 1923.9 1926.5 913.5 919.4 977.7 981.9 990.2 19700.2 21316.9 21370.0 21397.8 21623.4 888.1 935.0 941.8 966.9 974.6 8900.0 10488.9 11264.5 11320.4 11358.4 575501.0 585039.1 591759.0 603949.0 606576.0 111905.4 119967.8 120175.0 135903.0 142161.0 870.4 950.5 1012.2 1016.2 1017.6 18810.9 19616.6 19748.1 19829.2 19862.3 49302.8 55841.0 55921.7 56573.6 57110.4 58401.7 71605.0 80041.6 81023.8 82707.0 6386.6 8003.5 8213.8 8254.2 8348.7 11369.8 12624.6 12871.4 13360.4 13440.9 9548.9 9592.3 10743.8 10783.3 11294.0 10300.0 10325.0 11184.4 11274.0 11822.5 5862.6 7530.5 10780.1 11606.5 11714.8 7994.2 8222.2 8401.5 8402.1 8580.0 8246.2 10843.1 11231.8 11368.7 11604.7 06:25:08 INFO - PROCESS | 1660 | 06:25:08 INFO - PROCESS | 1660 | [#3] mootools.html Cycles:180 Average:5668.31 Median:4858.97 stddev:3224.75 (66.4%) stddev-sans-first:3217.31 06:25:08 INFO - PROCESS | 1660 | Values: 1328.8 1488.5 1519.0 1702.1 1886.9 7884.4 8397.0 8644.8 8943.6 8951.9 8778.5 8859.0 8863.1 8875.1 8878.9 2328.2 2354.2 2355.3 2355.6 2358.4 2300.8 2344.7 2344.7 2346.3 2354.6 2311.1 2337.5 2339.5 2350.6 2360.2 2297.8 2321.0 2326.9 2327.5 2329.1 2315.8 2320.7 2321.2 2323.8 2328.0 8733.0 8804.3 8857.3 8981.0 9008.0 5245.8 5392.0 5398.1 5398.9 5402.4 3523.6 3536.1 3581.6 3606.0 3623.3 1035.4 1045.0 1045.6 1049.3 1066.2 11657.0 11710.1 11787.0 11804.5 11816.0 4344.5 4405.8 4532.5 4568.4 4573.8 9172.0 9175.0 9188.4 9188.7 9194.4 5249.9 5250.7 5257.0 5257.4 5263.8 4159.3 4429.4 4601.3 4610.0 4932.1 3681.1 3758.5 3793.8 3806.8 3809.2 1076.9 1134.6 1135.9 1141.1 1159.0 864.6 870.9 880.1 905.7 927.7 5567.8 5791.2 5842.0 5847.6 5959.7 838.2 911.2 921.5 938.0 957.3 3476.7 3675.6 3772.0 3850.5 3964.2 10563.4 10962.9 10967.0 10992.1 11001.1 10751.6 10854.6 10940.3 10965.5 10982.7 7102.3 8175.4 8317.1 8329.5 8336.7 4793.4 5592.6 5791.5 5820.1 5873.5 9808.2 10230.3 10236.8 10286.1 10294.5 9336.1 9719.8 10173.2 10181.0 10333.6 7145.4 7365.9 7377.5 7508.8 7647.7 8165.6 8265.8 8287.8 8363.4 8369.3 7543.4 7571.8 7602.2 7614.9 7642.0 7378.6 7424.5 7441.7 7508.1 7597.8 6912.3 6936.9 6996.9 7004.1 7015.2 4627.1 4702.8 4842.2 4849.2 4896.9 4868.7 4887.6 5011.6 5039.3 5094.3 06:25:08 INFO - PROCESS | 1660 | 06:25:08 INFO - PROCESS | 1660 | [#4] prototype.html Cycles:180 Average:4017.90 Median:4334.88 stddev:1203.34 (27.8%) stddev-sans-first:1173.31 06:25:08 INFO - PROCESS | 1660 | Values: 266.2 301.9 310.2 313.8 318.2 4252.7 4960.1 5174.1 5193.4 5203.9 4340.2 4883.8 5069.8 5103.7 5149.4 3664.0 3684.3 3980.0 4007.2 4008.7 3673.9 3996.0 3998.0 4007.9 4053.8 3764.4 3791.1 3914.9 3916.7 3921.5 3383.1 3811.3 3893.9 3915.5 3936.8 2728.8 2998.6 3404.8 3433.7 3435.5 4136.6 4815.6 4974.3 4983.7 5000.9 4453.1 4470.8 4478.3 4494.8 4522.5 5331.0 5382.2 5410.5 5412.6 5419.7 2996.1 3410.9 3728.6 3738.0 3754.8 5594.0 5667.2 5673.4 5682.7 5768.4 3781.6 3784.7 3786.9 3802.1 3823.9 3283.3 3871.7 3871.8 3887.8 3912.3 3696.8 4115.7 4335.8 4442.5 4496.3 4743.5 5410.2 5428.8 5436.8 5507.9 1173.4 1231.7 1268.0 1289.0 1313.9 803.0 816.7 824.7 852.7 858.4 3864.7 4057.6 4296.4 4343.5 4345.9 4003.7 4355.0 4413.0 4610.7 4614.8 3683.9 3729.9 4234.0 4288.5 4334.0 2188.3 2309.6 2400.8 2417.5 2432.5 4455.0 4635.6 4673.0 4675.5 4704.3 3897.7 4355.8 4647.8 4671.4 4713.7 3621.4 4360.8 4612.9 4707.8 4774.9 4515.8 4522.1 4543.8 4553.2 4606.5 3939.7 4290.8 4544.0 4546.4 4547.0 3945.5 4086.6 4321.0 4497.6 4504.0 3317.4 3323.3 3327.3 3367.8 3399.8 4233.3 4609.0 4611.9 4616.7 4668.6 3794.3 3916.6 4001.8 4455.3 4473.3 3575.6 3919.6 4071.7 4206.2 4324.5 3902.9 3903.9 5037.6 5255.6 5274.8 4359.5 4802.0 5467.1 5480.4 5484.8 4913.2 5344.2 5350.0 5354.4 5362.9 06:25:08 INFO - PROCESS | 1660 | 06:25:08 INFO - PROCESS | 1660 | [#5] yui.html Cycles:180 Average:24858.91 Median:3496.27 stddev:39369.60 (1126.0%) stddev-sans-first:39438.19 06:25:08 INFO - PROCESS | 1660 | Values: 679.4 733.8 777.0 792.2 824.3 15591.5 15745.8 15772.8 15777.8 15793.3 14185.0 14275.0 14279.4 14302.1 14316.3 685.5 697.8 704.4 704.5 860.3 834.6 855.7 855.8 867.4 867.5 911.8 911.9 912.0 913.1 913.3 724.2 904.7 905.0 905.5 907.0 549.7 662.5 680.1 682.1 686.1 14068.7 14086.4 14154.7 14303.0 14317.6 13398.7 13691.7 13814.5 13932.1 14059.6 10318.6 12085.4 12388.5 12456.4 12918.5 4434.1 4449.9 4469.4 4499.1 4523.3 111327.0 111492.0 111771.0 111932.0 111950.0 10650.9 10891.4 11056.0 11197.2 11455.8 21446.7 21552.0 21556.5 21558.5 21615.4 7659.3 7798.4 7856.1 7874.8 7957.5 4264.1 4300.3 4329.9 4410.0 4465.3 3392.1 3415.3 3491.8 3500.8 3504.3 652.6 658.8 667.1 675.2 715.8 561.4 663.9 669.5 669.9 670.9 9119.5 9183.9 9341.7 9561.4 9720.5 533.8 562.6 649.5 673.4 685.2 4142.3 4467.2 4655.5 4714.7 4821.2 123015.0 142468.0 145804.0 146526.0 149536.0 127057.4 130768.0 131821.0 131858.3 135171.5 96141.0 97684.5 100036.0 112447.0 118028.1 9721.0 9815.6 9822.5 9925.8 10019.9 65308.0 65660.0 65957.0 66898.0 68910.7 80960.6 94428.5 99749.0 99992.5 106143.0 12026.9 12057.5 12263.8 12432.8 12553.5 14370.9 14456.0 14702.5 14852.6 15205.9 13536.9 13584.2 14153.3 14257.6 14261.0 13494.3 13787.0 13791.9 14038.6 14175.8 11761.2 13191.3 13481.1 13482.0 13484.7 11346.0 11366.4 11394.3 11765.2 11767.6 8978.4 9479.3 10349.3 10381.5 11271.6 06:25:08 INFO - PROCESS | 1660 | -------- Summary: end -------- 06:25:08 INFO - PROCESS | 1660 | 06:25:09 INFO - TEST-INFO | 1660: exit 0 06:25:09 INFO - TEST-OK | dromaeo_css | took 1119608ms 06:25:09 INFO - TEST-START | kraken 06:25:09 INFO - operating with platform_type : mac_ 06:25:09 INFO - Initialising browser for kraken test... 06:25:09 INFO - TEST-INFO | started process 1667 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/tmp_KWiJj/profile http://localhost:49280/getInfo.html) 06:25:11 INFO - PROCESS | 1667 | __metrics Screen width/height:1600/1200 06:25:11 INFO - PROCESS | 1667 | colorDepth:24 06:25:11 INFO - PROCESS | 1667 | Browser inner width/height: 1024/689 06:25:11 INFO - PROCESS | 1667 | __metrics 06:25:11 INFO - PROCESS | 1667 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 06:25:11 INFO - PROCESS | 1667 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:25:12 INFO - TEST-INFO | 1667: exit 0 06:25:12 INFO - Browser initialized. 06:25:12 INFO - Running cycle 1/1 for kraken test... 06:25:12 INFO - TEST-INFO | started process 1669 (/builds/slave/test/build/application/FirefoxNightly.app/Contents/MacOS/firefox -foreground -profile /var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/tmp_KWiJj/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 06:25:24 INFO - PROCESS | 1669 | RSS: Main: 263147520 06:25:24 INFO - PROCESS | 1669 | 06:25:27 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49280/tests/kraken/driver.html?testName=audio-beat-detection) 06:25:28 INFO - PROCESS | 1669 | RSS: Main: 311144448 06:25:28 INFO - PROCESS | 1669 | 06:25:30 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49280/tests/kraken/driver.html?testName=audio-dft) 06:25:31 INFO - PROCESS | 1669 | RSS: Main: 310890496 06:25:31 INFO - PROCESS | 1669 | 06:25:34 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49280/tests/kraken/driver.html?testName=audio-fft) 06:25:35 INFO - PROCESS | 1669 | RSS: Main: 399994880 06:25:35 INFO - PROCESS | 1669 | 06:25:37 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49280/tests/kraken/driver.html?testName=audio-oscillator) 06:25:38 INFO - PROCESS | 1669 | RSS: Main: 302104576 06:25:38 INFO - PROCESS | 1669 | 06:25:40 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49280/tests/kraken/driver.html?testName=imaging-gaussian-blur) 06:25:40 INFO - PROCESS | 1669 | RSS: Main: 303702016 06:25:40 INFO - PROCESS | 1669 | 06:25:43 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49280/tests/kraken/driver.html?testName=imaging-darkroom) 06:25:44 INFO - PROCESS | 1669 | RSS: Main: 341176320 06:25:44 INFO - PROCESS | 1669 | 06:25:46 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49280/tests/kraken/driver.html?testName=imaging-desaturate) 06:25:47 INFO - PROCESS | 1669 | RSS: Main: 342089728 06:25:47 INFO - PROCESS | 1669 | 06:25:50 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49280/tests/kraken/driver.html?testName=json-parse-financial) 06:25:51 INFO - PROCESS | 1669 | RSS: Main: 338939904 06:25:51 INFO - PROCESS | 1669 | 06:25:52 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49280/tests/kraken/driver.html?testName=json-stringify-tinderbox) 06:25:53 INFO - PROCESS | 1669 | RSS: Main: 314753024 06:25:53 INFO - PROCESS | 1669 | 06:25:55 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49280/tests/kraken/driver.html?testName=stanford-crypto-aes) 06:25:55 INFO - PROCESS | 1669 | RSS: Main: 318935040 06:25:55 INFO - PROCESS | 1669 | 06:25:58 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49280/tests/kraken/driver.html?testName=stanford-crypto-ccm) 06:25:58 INFO - PROCESS | 1669 | RSS: Main: 321478656 06:25:58 INFO - PROCESS | 1669 | 06:26:01 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49280/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 06:26:02 INFO - PROCESS | 1669 | RSS: Main: 333537280 06:26:02 INFO - PROCESS | 1669 | 06:26:05 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49280/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 06:26:05 INFO - PROCESS | 1669 | RSS: Main: 332705792 06:26:05 INFO - PROCESS | 1669 | 06:26:07 INFO - PROCESS | 1669 | Cycle 1(1): loaded http://localhost:49280/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49280/tests/kraken/driver.html?testName=ai-astar) 06:26:08 INFO - PROCESS | 1669 | RSS: Main: 377110528 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | __start_tp_report 06:26:08 INFO - PROCESS | 1669 | _x_x_mozilla_page_load 06:26:08 INFO - PROCESS | 1669 | _x_x_mozilla_page_load_details 06:26:08 INFO - PROCESS | 1669 | |i|pagename|runs| 06:26:08 INFO - PROCESS | 1669 | |0;ai-astar;113;116;114;112;112;113;113;113;113;113 06:26:08 INFO - PROCESS | 1669 | |1;audio-beat-detection;150;115;113;153;117;116;117;114;149;115 06:26:08 INFO - PROCESS | 1669 | |2;audio-dft;243;169;243;254;192;182;182;185;183;180 06:26:08 INFO - PROCESS | 1669 | |3;audio-fft;78;58;57;88;60;60;58;73;83;57 06:26:08 INFO - PROCESS | 1669 | |4;audio-oscillator;85;71;94;70;67;89;124;94;68;90 06:26:08 INFO - PROCESS | 1669 | |5;imaging-gaussian-blur;89;85;88;86;87;84;88;85;87;84 06:26:08 INFO - PROCESS | 1669 | |6;imaging-darkroom;93;94;94;103;93;93;95;94;93;93 06:26:08 INFO - PROCESS | 1669 | |7;imaging-desaturate;87;104;142;138;84;87;84;84;84;86 06:26:08 INFO - PROCESS | 1669 | |8;json-parse-financial;55;50;52;52;53;55;53;52;52;74 06:26:08 INFO - PROCESS | 1669 | |9;json-stringify-tinderbox;65;74;77;75;73;69;93;61;67;90 06:26:08 INFO - PROCESS | 1669 | |10;stanford-crypto-aes;87;86;83;106;90;85;89;86;85;90 06:26:08 INFO - PROCESS | 1669 | |11;stanford-crypto-ccm;147;165;156;145;144;145;147;143;174;142 06:26:08 INFO - PROCESS | 1669 | |12;stanford-crypto-pbkdf2;173;171;171;172;167;173;171;170;168;170 06:26:08 INFO - PROCESS | 1669 | |13;stanford-crypto-sha256-iterative;67;68;68;68;68;69;74;85;88;86 06:26:08 INFO - PROCESS | 1669 | __end_tp_report 06:26:08 INFO - PROCESS | 1669 | __start_cc_report 06:26:08 INFO - PROCESS | 1669 | _x_x_mozilla_cycle_collect,1932 06:26:08 INFO - PROCESS | 1669 | __end_cc_report 06:26:08 INFO - PROCESS | 1669 | __startTimestamp1475760368042__endTimestamp 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | ------- Summary: start ------- 06:26:08 INFO - PROCESS | 1669 | Number of tests: 14 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#0] ai-astar Cycles:10 Average:113.20 Median:113.00 stddev:1.14 (1.0%) stddev-sans-first:1.20 06:26:08 INFO - PROCESS | 1669 | Values: 113.0 116.0 114.0 112.0 112.0 113.0 113.0 113.0 113.0 113.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#1] audio-beat-detection Cycles:10 Average:125.90 Median:117.00 stddev:17.16 (14.7%) stddev-sans-first:15.83 06:26:08 INFO - PROCESS | 1669 | Values: 150.0 115.0 113.0 153.0 117.0 116.0 117.0 114.0 149.0 115.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#2] audio-dft Cycles:10 Average:201.30 Median:188.50 stddev:31.94 (16.9%) stddev-sans-first:30.11 06:26:08 INFO - PROCESS | 1669 | Values: 243.0 169.0 243.0 254.0 192.0 182.0 182.0 185.0 183.0 180.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#3] audio-fft Cycles:10 Average:67.20 Median:66.50 stddev:12.08 (18.2%) stddev-sans-first:12.17 06:26:08 INFO - PROCESS | 1669 | Values: 78.0 58.0 57.0 88.0 60.0 60.0 58.0 73.0 83.0 57.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#4] audio-oscillator Cycles:10 Average:85.20 Median:87.00 stddev:17.50 (20.1%) stddev-sans-first:18.57 06:26:08 INFO - PROCESS | 1669 | Values: 85.0 71.0 94.0 70.0 67.0 89.0 124.0 94.0 68.0 90.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#5] imaging-gaussian-blur Cycles:10 Average:86.30 Median:87.00 stddev:1.77 (2.0%) stddev-sans-first:1.58 06:26:08 INFO - PROCESS | 1669 | Values: 89.0 85.0 88.0 86.0 87.0 84.0 88.0 85.0 87.0 84.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#6] imaging-darkroom Cycles:10 Average:94.50 Median:93.50 stddev:3.06 (3.3%) stddev-sans-first:3.20 06:26:08 INFO - PROCESS | 1669 | Values: 93.0 94.0 94.0 103.0 93.0 93.0 95.0 94.0 93.0 93.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#7] imaging-desaturate Cycles:10 Average:98.00 Median:84.00 stddev:22.95 (27.3%) stddev-sans-first:24.00 06:26:08 INFO - PROCESS | 1669 | Values: 87.0 104.0 142.0 138.0 84.0 87.0 84.0 84.0 84.0 86.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#8] json-parse-financial Cycles:10 Average:54.80 Median:53.00 stddev:6.91 (13.0%) stddev-sans-first:7.33 06:26:08 INFO - PROCESS | 1669 | Values: 55.0 50.0 52.0 52.0 53.0 55.0 53.0 52.0 52.0 74.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#9] json-stringify-tinderbox Cycles:10 Average:74.40 Median:74.50 stddev:10.28 (13.8%) stddev-sans-first:10.32 06:26:08 INFO - PROCESS | 1669 | Values: 65.0 74.0 77.0 75.0 73.0 69.0 93.0 61.0 67.0 90.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#10] stanford-crypto-aes Cycles:10 Average:88.70 Median:86.50 stddev:6.50 (7.5%) stddev-sans-first:6.86 06:26:08 INFO - PROCESS | 1669 | Values: 87.0 86.0 83.0 106.0 90.0 85.0 89.0 86.0 85.0 90.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#11] stanford-crypto-ccm Cycles:10 Average:150.80 Median:147.00 stddev:10.79 (7.3%) stddev-sans-first:11.36 06:26:08 INFO - PROCESS | 1669 | Values: 147.0 165.0 156.0 145.0 144.0 145.0 147.0 143.0 174.0 142.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:170.60 Median:171.00 stddev:1.96 (1.1%) stddev-sans-first:1.87 06:26:08 INFO - PROCESS | 1669 | Values: 173.0 171.0 171.0 172.0 167.0 173.0 171.0 170.0 168.0 170.0 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - PROCESS | 1669 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:74.10 Median:71.50 stddev:8.69 (12.1%) stddev-sans-first:8.82 06:26:08 INFO - PROCESS | 1669 | Values: 67.0 68.0 68.0 68.0 68.0 69.0 74.0 85.0 88.0 86.0 06:26:08 INFO - PROCESS | 1669 | -------- Summary: end -------- 06:26:08 INFO - PROCESS | 1669 | 06:26:08 INFO - TEST-INFO | 1669: exit 0 06:26:08 INFO - TEST-OK | kraken | took 59359ms 06:26:08 INFO - SUITE-END | took 1178s 06:26:09 INFO - Completed test suite (00:19:39) 06:26:09 INFO - javascript benchmark 06:26:09 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3297.9010629681106, 3308.387948229578, 3312.2547426828964, 3354.85934782174, 3374.510695949087, 5503.944960550393, 5594.328680558334, 5626.54987600992, 5640.182173584828, 5672.432756724331, 4597.977010114953, 5603.215549823028, 5624.465675760796, 5627.015272327347, 5629.8592535186535, 5084.872878178047, 5114.130597798365, 5118.513741194581, 5150.072986862363, 5204.531592156705, 5122.487751224867, 5219.556337711299, 5225.634205605609, 5226.111561034614, 5238.109521381355, 5104.438511763703, 5133.3326667533165, 5171.87070323243, 5203.349581302337, 5224.50367215114, 5189.506996835314, 5214.791408343662, 5219.164933610642, 5227.712475813829, 5288.524032837063, 5021.698698078127, 5033.496650334974, 5148.433672296082, 5150.330457040598, 5161.045206636784, 4651.906961860744, 5504.146857237135, 5546.889062218733, 5554.444555544454, 5577.944220557823, 6117.418845209698, 6124.203853499062, 6170.537209709245, 6185.072239164117, 6188.412100850412, 6064.36324185963, 6161.599496032743, 6254.968725156391, 6256.937430625727, 6283.151774510474, 4789.976050119727, 5645.5483561315405, 5672.0, 5693.857653558612, 5719.799807006735, 6258.374162583706, 6282.403171698681, 6291.213598300213, 6296.275928268216, 6299.811005669837, 6040.0, 6047.425494578008, 6072.787452439144, 6087.482563982111, 6088.391160883964, 5957.136215248851, 6015.639061656227, 6100.75596976116, 6107.450329470369, 6162.815115546541, 5100.872478188075, 6096.847578810565, 6117.996333785, 6124.716609781064, 6128.442013630915, 6112.419320164578, 6113.867421735435, 6138.058862615638, 6143.938560614426, 6145.877082458326, 4786.521347865255, 4797.992421591435, 4826.710397376099, 4848.0, 4852.344933434012, 4387.912241755147, 4409.36064270679, 4422.624076953431, 4425.822967081281, 4432.601065904019, 4460.30865215892, 5649.689267090267, 5698.686572238484, 5732.398098199712, 5739.225204597409, 6173.135760993465, 6183.103449999725, 6205.441510264008, 6213.409726076015, 6221.09794079865, 5629.634073785191, 5679.744411501492, 5715.999700052557, 5720.056190728566, 5730.455606717355, 5188.63679542436, 5232.3459567554055, 5235.110031294689, 5269.894602107936, 5331.573474122061, 6164.845878852975, 6191.19514463117, 6219.595726277777, 6244.469220116341, 6245.250569931637, 6188.535859810622, 6207.037909124093, 6216.0, 6225.190725205694, 6233.5636505446, 5350.732463376893, 6193.566450348432, 6253.530985176221, 6257.09272155544, 6262.624242545462, 5924.822255332347, 6011.579189456696, 6017.488513476228, 6041.577089603686, 6052.788152414644, 6057.878842423039, 6164.753409863734, 6187.071939208975, 6195.101710252078, 6221.377862213742, 5908.291005079418, 5976.372480889618, 6025.849353766191, 6029.071934401789, 6049.606775559574, 4904.2643603459765, 5842.503387212135, 5923.259592550931, 5993.3706960768495, 6005.6396616203165, 5798.681072540882, 5807.82576522705, 5845.2108965290845, 5864.530837533072, 5904.881902361843, 6029.788957386646, 6045.758169673164, 6050.90923636137, 6066.120412540069, 6090.543209259412, 4888.5111488850835, 5768.682722450306, 5857.619254748428, 5873.9412605873395, 5877.0], "value": 5586.976419238961, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [475.62663309302184, 478.0916259107696, 492.2296605811904, 521.8904030153667, 525.2934802690385, 30680.539791903113, 38960.41559376608, 39938.600613993854, 40132.9966750831, 40203.59796402035, 41537.37693934586, 41974.58025419745, 42113.15773684524, 42130.36804447936, 42144.0, 9675.661351852668, 9853.70438886831, 9874.407535547854, 9878.555465004092, 9903.702888913343, 8793.076726943675, 9028.77428064297, 11850.170488065838, 12146.514139434412, 12192.207506512093, 11939.104567157454, 12006.579769708062, 12025.458854351575, 12030.458629361656, 12041.397930103503, 12112.818307725347, 12215.2670839749, 12225.755484890342, 12232.877671223263, 12295.262284262973, 8622.525761083138, 8847.867281990775, 11538.192326537146, 11863.050955923505, 11914.761704765857, 39557.80221098876, 39760.20479590421, 39762.60237397618, 39810.80567582977, 39903.0, 3191.5372271020574, 3251.3009702913987, 3356.7985920844585, 3459.39460594395, 3577.7853328800097, 30151.69848301511, 30373.24066898323, 30558.0, 31077.533836992465, 31755.682443175734, 3050.1916991997136, 3077.5999120114466, 3081.8613162407746, 3197.776155669104, 3212.0524445288697, 441543.0, 441719.0, 446690.0, 446926.76536617434, 449850.0, 56227.15659265114, 56632.433675662716, 56663.15005274924, 56714.43285567174, 56860.71569642208, 34337.364455798146, 35017.474737878954, 35191.29617407689, 35345.64654353423, 35814.92555223347, 15708.842911570966, 15882.76175857363, 15899.443519476763, 15900.284487198103, 15946.0, 11146.996770290712, 12086.69783255408, 12195.268283902995, 12199.93900030512, 12202.938985305016, 16042.518724438285, 16455.012699238083, 16456.83543164577, 16457.60110390606, 16474.670506589802, 6778.762743303961, 7597.581088510193, 7875.763727088197, 8007.199280071946, 8059.879101813477, 812.69600682067, 833.3541505333416, 869.9478031318141, 926.3515539122641, 1051.4112097225425, 25847.095351662603, 28276.575851362246, 29457.263568410963, 29924.70075299219, 30160.396792064035, 930.5765876526165, 1093.7593729379523, 1107.1364335818075, 1143.3768596115137, 1181.1731787748438, 14107.647308817157, 15438.073715577102, 15890.920545397199, 16588.336466541205, 16999.575010624587, 660230.0, 660264.0, 660718.0, 662358.0, 664466.0, 57106.0, 57420.42579574151, 57517.424825752045, 57668.42331576715, 57676.71161644165, 1167.9299242045504, 1201.1171788735273, 1242.782513060229, 1328.5018118205674, 1330.4944121233868, 28514.144575661932, 29415.26461838471, 29646.851765741034, 30245.395092098475, 30245.546316805707, 47640.52359476499, 48279.75860120677, 48421.273680895516, 48461.75769121132, 48473.27290090581, 567034.0, 570822.0, 571276.0, 572618.0, 573004.0, 24778.628320575568, 25511.87244063842, 25639.487210256062, 25683.35791605225, 25714.485710286062, 43619.34570981501, 44280.778596106815, 44745.77627111843, 44827.551724482335, 45420.31869522026, 36614.81692591627, 36897.70858019956, 37083.07292317713, 37597.62402375941, 37692.43461348137, 36258.91223263306, 36429.81785091058, 37397.43903841499, 37693.4345984805, 37795.433068503444, 35400.64599354076, 35810.8209458951, 36355.63644363522, 36615.45076823796, 37087.0, 30703.385932281675, 31336.05991820249, 31545.143563813268, 34726.65273347234, 35550.64449355473, 24915.538852128226, 25050.62424063604, 25063.87468062648, 25448.363790905376, 25846.966121354933], "value": 19528.89809461304, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [352.12145696487266, 369.75041846753436, 371.34086995582857, 378.94315852622105, 399.9300122478567, 14945.476908308212, 15075.020123691953, 16094.436694715672, 20265.189392424323, 20759.584808303825, 19657.606847863033, 19869.701954470693, 20172.193112275527, 20782.584348313023, 21016.684749728767, 5861.560382971273, 5947.553933454987, 6118.0, 6171.969140154293, 6177.25872895251, 5904.940950590503, 6068.423499767537, 6090.543209259301, 6098.969505152468, 6104.114903339013, 4154.771487568182, 4392.099619577994, 6430.356964303555, 6743.49423793215, 6803.387695107439, 5741.397153298885, 6074.787382441594, 6810.659467026654, 6826.351496607815, 6827.795166144999, 5985.0, 5989.251343582052, 5990.341062483123, 5996.8500787480225, 6001.5198784097165, 13126.474941002349, 18123.093845307812, 22061.889690551605, 24744.752552474423, 24968.375790605198, 2128.3934078787624, 2152.1929276521305, 2175.2712841198218, 2329.266281121458, 2421.5520128776234, 9750.268729845218, 9888.357256778287, 10005.749856253578, 10406.635767748168, 10471.581136754521, 1865.3378050792044, 1915.6934890417606, 1919.7504324437873, 1921.8366438852715, 1937.2347922570507, 104428.0, 108689.0, 117094.41452792767, 118938.40530797378, 122067.0, 11385.430728463543, 11488.368139752227, 11514.36670983104, 11515.424228788526, 11694.356810375511, 14441.49454769078, 14518.419263229564, 14525.055871368539, 14540.709185816224, 14542.054766440147, 8242.587870606445, 8506.0, 8531.658733650584, 8632.266257368068, 8652.697155599524, 8400.243978042006, 8420.0, 8440.66237350499, 8594.31245500371, 8604.956975215084, 4419.204543182193, 4529.38853254813, 4564.863054108382, 4610.423697037871, 4662.883427914329, 1840.1995132117572, 1923.1634239106033, 1923.4614307993784, 1923.923043078289, 1926.489480287725, 913.4656226107801, 919.4023884475145, 977.6627063663025, 981.8723565936383, 990.1979396688705, 19700.211991520464, 21316.893415532824, 21370.0, 21397.76529070692, 21623.351299461043, 888.0852721696663, 934.9859752103724, 941.8493041113389, 966.9419834809934, 974.6247694637616, 8899.955500222586, 10488.947555262328, 11264.493097810455, 11320.377379244055, 11358.432078396047, 575501.0, 585039.1496085069, 591759.0, 603948.960510398, 606576.0, 111905.44047279874, 119967.80032199566, 120175.0, 135903.0, 142161.0, 870.3776799588325, 950.5199874063553, 1012.2205901455837, 1016.1565900302732, 1017.6082208349839, 18810.905945470186, 19616.607667846278, 19748.111334989673, 19829.20683172657, 19862.304819331253, 49302.75348623234, 55841.0, 55921.72039139778, 56573.585660357174, 57110.428895712175, 58401.70799145977, 71605.0, 80041.59979200299, 81023.78464322921, 82707.0, 6386.616802991835, 8003.5197888126895, 8213.79465513343, 8254.174582541698, 8348.749537513884, 11369.829452558384, 12624.55814046504, 12871.356432178542, 13360.398782054637, 13440.865591343962, 9548.85676714836, 9592.328537002342, 10743.785124297627, 10783.299085559414, 11294.0, 10300.0, 10325.0, 11184.440777961232, 11274.041706455044, 11822.467988940347, 5862.618929769551, 7530.548167109991, 10780.137588992706, 11606.477708503306, 11714.824277635671, 7994.2405471480115, 8222.17778222173, 8401.495910245405, 8402.117777633504, 8580.0, 8246.175382461706, 10843.062248497068, 11231.775364492501, 11368.715782105513, 11604.709882252673], "value": 9451.364283835333, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1328.8272524571805, 1488.493912069896, 1518.9696206075878, 1702.1149002518691, 1886.9245230190784, 7884.369250459964, 8396.99236091669, 8644.783880402993, 8943.64225430982, 8951.910480895189, 8778.517181555011, 8858.955705221464, 8863.069377715343, 8875.112488751138, 8878.866816997734, 2328.2433209207034, 2354.176038386568, 2355.316958082154, 2355.5759963206615, 2358.3514533503253, 2300.804431623306, 2344.7069116360453, 2344.742078371378, 2346.272655476808, 2354.5761762882676, 2311.087120587367, 2337.544178885118, 2339.450229196146, 2350.576896158691, 2360.1503458754833, 2297.8046866016407, 2320.9767902320928, 2326.918557850467, 2327.5112226432384, 2329.0683726509365, 2315.7568455312116, 2320.7331156917003, 2321.1759825261956, 2323.790858822714, 2328.0222306631254, 8733.0, 8804.295656347476, 8857.335699822475, 8981.01208867024, 9008.009118996904, 5245.79016839326, 5391.973040134813, 5398.13629819227, 5398.91901621476, 5402.432744561804, 3523.594786599548, 3536.098294934801, 3581.623929487392, 3605.963940360589, 3623.275344930998, 1035.4201647077662, 1045.0490054050777, 1045.63402809017, 1049.3284298049255, 1066.1950227578207, 11657.0, 11710.063194944469, 11786.998105160987, 11804.46879890407, 11815.995640370578, 4344.522102568715, 4405.7797110144365, 4532.478764942008, 4568.360429539867, 4573.794179261941, 9172.0, 9175.036621154815, 9188.356815022884, 9188.678396256098, 9194.402363846328, 5249.947500525022, 5250.684958902478, 5256.9737151314, 5257.395399529103, 5263.763130659129, 4159.272127377697, 4429.402030725811, 4601.28680054592, 4610.031893302377, 4932.062908047459, 3681.0981309579324, 3758.4550240215017, 3793.791341476245, 3806.752561083576, 3809.238152369537, 1076.9461526923621, 1134.6369161868122, 1135.9261647992853, 1141.0814294492848, 1158.9942050289862, 864.6325311742485, 870.8606622940426, 880.1418616848649, 905.6678557273113, 927.6567669962158, 5567.777288908479, 5791.160281759121, 5842.0, 5847.561432892465, 5959.702014899238, 838.1911455445525, 911.166282851197, 921.4747593871563, 937.990620093804, 957.3155194036298, 3476.652334766554, 3675.632436756303, 3771.9811400943368, 3850.4609354690365, 3964.1873415949663, 10563.366198028143, 10962.945185274182, 10967.0, 10992.120630349553, 11001.064909482784, 10751.6236931707, 10854.565817367375, 10940.288881222696, 10965.50655220517, 10982.725431864268, 7102.254263302279, 8175.427720059539, 8317.085120636724, 8329.541875196923, 8336.666533338599, 4793.376861008047, 5592.552595792408, 5791.536677065909, 5820.126980952891, 5873.530117590497, 9808.16630586408, 10230.28388012832, 10236.795264094528, 10286.125679317342, 10294.536745846304, 9336.06639336061, 9719.757006074904, 10173.23700722434, 10181.0, 10333.638322658671, 7145.39264162552, 7365.926340736738, 7377.483576149618, 7508.849823003618, 7647.655855486628, 8165.632546535539, 8265.752027439186, 8287.792805179919, 8363.372747044117, 8369.330453563578, 7543.434242431949, 7571.796355798705, 7602.201768814416, 7614.923850761422, 7642.006539149875, 7378.557286562824, 7424.517406368569, 7441.702331906663, 7508.0990281166605, 7597.772066838003, 6912.343327383891, 6936.930630693629, 6996.860062798817, 7004.124484439445, 7015.193252775792, 4627.143978363879, 4702.824293926518, 4842.15262329098, 4849.224124140121, 4896.877578060435, 4868.707877527359, 4887.584555312838, 5011.624128190328, 5039.26930595069, 5094.2867998479505], "value": 4526.5399472041445, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [266.21201244316825, 301.8701958157991, 310.17957502406136, 313.81014486235824, 318.2378204200937, 4252.723572967759, 4960.1319769040365, 5174.085588332322, 5193.350831146112, 5203.947960520393, 4340.175366680329, 4883.829065982683, 5069.822556210534, 5103.693778373291, 5149.40781810092, 3663.981680091596, 3684.299983003221, 3979.9801000994953, 4007.2386246613196, 4008.6793056555553, 3673.8897833065053, 3995.960040399588, 3997.9600203998025, 4007.939880901789, 4053.817578208973, 3764.3976963685814, 3791.1187497501824, 3914.921701565967, 3916.667083297923, 3921.5490218624795, 3383.1372999885116, 3811.2949104415634, 3893.8637147699696, 3915.530136383624, 3936.783476908769, 2728.8089833711647, 2998.61018067652, 3404.8209146146487, 3433.725301975836, 3435.5018522314126, 4136.58634136587, 4815.6388270879825, 4974.328465657162, 4983.6760610560195, 5000.924986125211, 4453.109378124355, 4470.776461176961, 4478.261086920655, 4494.797734101973, 4522.5025247222775, 5330.974229792654, 5382.165764306539, 5410.48600382963, 5412.5940554458175, 5419.674819510842, 2996.056242283674, 3410.9488357674654, 3728.6457786510236, 3738.0, 3754.7747135171976, 5594.028239949641, 5667.186500319858, 5673.446948872983, 5682.744276507526, 5768.3654797972185, 3781.565120011179, 3784.735068545175, 3786.8674596388996, 3802.0914000789417, 3823.9426408603895, 3283.294091770233, 3871.7483363581277, 3871.825767840454, 3887.8250478728523, 3912.2785974171843, 3696.77819330841, 4115.73247738896, 4335.7615331157085, 4442.4899931538575, 4496.3255511673515, 4743.525647435298, 5410.161424979135, 5428.8099916503525, 5436.776725236869, 5507.944920550824, 1173.4484792147678, 1231.6982339326921, 1267.9539380011527, 1288.9806652900213, 1313.9145955513052, 802.9919700803034, 816.6896579299828, 824.6577670266892, 852.6589364254224, 858.3991206155716, 3864.6908247340143, 4057.6145266199665, 4296.3555466680245, 4343.457067866517, 4345.9348109778375, 4003.739756915791, 4354.995053413135, 4413.029133590605, 4610.746408947473, 4614.838480653161, 3683.9447408288897, 3729.8881033569037, 4233.967695506174, 4288.499025341168, 4334.0, 2188.33255856962, 2309.595820731365, 2400.819938504619, 2417.456072383735, 2432.477017441259, 4454.977725111354, 4635.605973492224, 4672.976550208539, 4675.545338697143, 4704.270838020112, 3897.6881849451975, 4355.847545335898, 4647.767611619405, 4671.43942726875, 4713.690291757083, 3621.42878556228, 4360.79481581044, 4612.86161415158, 4707.764611769467, 4774.880627984328, 4515.841945531891, 4522.118186953512, 4543.79552920126, 4553.2259515881715, 4606.516315786928, 3939.7439166454087, 4290.828366865415, 4543.977280113579, 4546.386237857979, 4546.977265113654, 3945.5265368156006, 4086.5697006047644, 4321.027768752006, 4497.640188784955, 4503.986603014296, 3317.357907835637, 3323.30210655765, 3327.3345330933425, 3367.7979321240805, 3399.7960122392738, 4233.330216489475, 4608.976955115203, 4611.907761844812, 4616.699914505546, 4668.5564871337165, 3794.2790869734663, 3916.6083391660604, 4001.819918103634, 4455.2575836297665, 4473.261911784519, 3575.6055138495485, 3919.627635374635, 4071.653909417733, 4206.20082184384, 4324.502682191463, 3902.902427439223, 3903.9414408783323, 5037.596992240685, 5255.605829562722, 5274.762635681327, 4359.476862776487, 4802.046741254034, 5467.097928841697, 5480.424555421623, 5484.8354549363585, 4913.213885778258, 5344.225087362233, 5350.0, 5354.437784032621, 5362.946370536245], "value": 3650.4843973182415, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [679.3749750229788, 733.8368685633271, 776.9611519424031, 792.2473650032471, 824.3240542754943, 15591.454299099534, 15745.84254157458, 15772.842271577281, 15777.763333549992, 15793.28930198141, 14185.0, 14275.0, 14279.357428915699, 14302.141871487718, 14316.28418579072, 685.547538624508, 697.7627606613751, 704.383664293743, 704.5138854190618, 860.3246451535546, 834.6077343648506, 855.6791203298762, 855.8159995600945, 867.405827008498, 867.5271976772674, 911.7902882337066, 911.8632205169245, 911.9589618467152, 913.0914739833842, 913.3378300731982, 724.1527412926836, 904.7014485219862, 905.0135352465811, 905.4702998745742, 906.9501177435238, 549.6674511920271, 662.5163630549725, 680.1430197950568, 682.0689758479689, 686.1251903822616, 14068.71862562743, 14086.366113524813, 14154.716905661931, 14303.0, 14317.57047288583, 13398.732025359535, 13691.726165476734, 13814.516491922734, 13932.094413863168, 14059.578212653636, 10318.638847640372, 12085.395730213455, 12388.504459821595, 12456.377181140906, 12918.483260669656, 4434.11317736454, 4449.866504004885, 4469.374287599739, 4499.1451624191295, 4523.2988886722615, 111327.0, 111492.0, 111771.0, 111932.0, 111950.0, 10650.89349106499, 10891.400972946563, 11056.0, 11197.216194866282, 11455.770884582262, 21446.678299825515, 21552.0, 21556.4610884726, 21558.461038474165, 21615.35153945384, 7659.315255218939, 7798.415118866108, 7856.135825059239, 7874.763757087297, 7957.482763620346, 4264.104538046983, 4300.333448315516, 4329.891752706208, 4410.0, 4465.307877279027, 3392.1010932103013, 3415.316936612687, 3491.790492570403, 3500.754947153675, 3504.299140171976, 652.55952232244, 658.7694306992514, 667.1493845347125, 675.1864003875319, 715.7795957891886, 561.4021067563033, 663.8937769956784, 669.4844969373555, 669.902864084705, 670.8926571748497, 9119.498427586546, 9183.862242066374, 9341.667536884726, 9561.426314421156, 9720.465374404333, 533.8211699080852, 562.5724449418472, 649.4674367018999, 673.4208580620663, 685.2496516314627, 4142.337226043818, 4467.195904737114, 4655.494404787258, 4714.66997310185, 4821.2045012573235, 123015.0, 142468.0, 145804.0, 146526.0, 149536.0, 127057.36471317585, 130768.0, 131821.0, 131858.34070829584, 135171.45528264178, 96141.0, 97684.51157744166, 100036.0, 112447.0, 118028.11550151935, 9721.0, 9815.55829987638, 9822.459764713009, 9925.751856203653, 10019.899801001897, 65308.0, 65660.0, 65957.0106448394, 66898.0, 68910.65544672245, 80960.59519702363, 94428.52785736302, 99749.0, 99992.50003749934, 106143.0, 12026.887846235653, 12057.506715749607, 12263.816042759187, 12432.751344972869, 12553.497860085494, 14370.856291436952, 14456.0, 14702.485413010494, 14852.554423367315, 15205.923970380078, 13536.932315338361, 13584.184948903097, 14153.292335382983, 14257.572272831832, 14261.0, 13494.32528373597, 13787.0, 13791.931210318533, 14038.649033774238, 14175.787363189354, 11761.235519691192, 13191.34043297812, 13481.056326057082, 13482.000574081254, 13484.662883427993, 11346.0, 11366.374849383032, 11394.25937314072, 11765.176437649625, 11767.646970590897, 8978.416402933788, 9479.289053321167, 10349.327293725884, 10381.532831022772, 11271.568172635158], "value": 7815.099065106732, "unit": "score"}], "name": "dromaeo_css", "value": 7146.203228354728, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 116.0, 114.0, 112.0, 112.0, 113.0, 113.0, 113.0, 113.0, 113.0], "value": 113.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 115.0, 113.0, 153.0, 117.0, 116.0, 117.0, 114.0, 149.0, 115.0], "value": 125.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [243.0, 169.0, 243.0, 254.0, 192.0, 182.0, 182.0, 185.0, 183.0, 180.0], "value": 201.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 58.0, 57.0, 88.0, 60.0, 60.0, 58.0, 73.0, 83.0, 57.0], "value": 67.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 71.0, 94.0, 70.0, 67.0, 89.0, 124.0, 94.0, 68.0, 90.0], "value": 85.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 85.0, 88.0, 86.0, 87.0, 84.0, 88.0, 85.0, 87.0, 84.0], "value": 86.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [93.0, 94.0, 94.0, 103.0, 93.0, 93.0, 95.0, 94.0, 93.0, 93.0], "value": 94.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 104.0, 142.0, 138.0, 84.0, 87.0, 84.0, 84.0, 84.0, 86.0], "value": 98.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 50.0, 52.0, 52.0, 53.0, 55.0, 53.0, 52.0, 52.0, 74.0], "value": 54.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 74.0, 77.0, 75.0, 73.0, 69.0, 93.0, 61.0, 67.0, 90.0], "value": 74.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 86.0, 83.0, 106.0, 90.0, 85.0, 89.0, 86.0, 85.0, 90.0], "value": 88.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 165.0, 156.0, 145.0, 144.0, 145.0, 147.0, 143.0, 174.0, 142.0], "value": 150.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [173.0, 171.0, 171.0, 172.0, 167.0, 173.0, 171.0, 170.0, 168.0, 170.0], "value": 170.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 68.0, 68.0, 68.0, 68.0, 69.0, 74.0, 85.0, 88.0, 86.0], "value": 74.1, "unit": "score"}], "name": "kraken", "value": 1484.9999999999998, "alertThreshold": 2.0}]} 06:26:09 INFO - Return code: 0 06:26:09 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 06:26:09 INFO - # TBPL SUCCESS # 06:26:09 INFO - Running pre test command check_screen_resolution with 'bash -c screenresolution get && screenresolution list && system_profiler SPDisplaysDataType' 06:26:09 INFO - Running command: ['bash', '-c', 'screenresolution get && screenresolution list && system_profiler SPDisplaysDataType'] in /builds/slave/test/build 06:26:09 INFO - Copy/paste: bash -c "screenresolution get && screenresolution list && system_profiler SPDisplaysDataType" 06:26:09 INFO - 2016-10-06 06:26:09.329 screenresolution[1673:10021] starting screenresolution argv=screenresolution get 06:26:09 INFO - 2016-10-06 06:26:09.333 screenresolution[1673:10021] Display 0: 1600x1200x32@60 06:26:09 INFO - 2016-10-06 06:26:09.339 screenresolution[1674:10024] starting screenresolution argv=screenresolution list 06:26:09 INFO - Available Modes on Display 0 06:26:09 INFO - 1600x1200x32@60 1152x870x32@75 1280x1024x32@75 06:26:09 INFO - 1024x768x32@75 1024x768x32@70 1024x768x32@60 06:26:09 INFO - 800x600x32@75 800x600x32@60 640x480x32@75 06:26:09 INFO - 640x480x32@60 1280x1024x32@60 1280x960x32@60 06:26:09 INFO - 1280x960x32@75 1344x1008x32@60 Graphics/Displays: 06:26:09 INFO - Intel Iris: 06:26:09 INFO - Chipset Model: Intel Iris 06:26:09 INFO - Type: GPU 06:26:09 INFO - Bus: Built-In 06:26:09 INFO - VRAM (Dynamic, Max): 1536 MB 06:26:09 INFO - Vendor: Intel (0x8086) 06:26:09 INFO - Device ID: 0x0a2e 06:26:09 INFO - Revision ID: 0x0009 06:26:09 INFO - Displays: 06:26:09 INFO - Display: 06:26:09 INFO - Resolution: 1600 x 1200 @ 60 Hz 06:26:09 INFO - Pixel Depth: 32-Bit Color (ARGB8888) 06:26:09 INFO - Display Serial Number: 1600x1200 60 06:26:09 INFO - Main Display: Yes 06:26:09 INFO - Mirror: Off 06:26:09 INFO - Online: Yes 06:26:09 INFO - Rotation: Supported 06:26:09 INFO - Return code: 0 06:26:09 INFO - Running post-action listener: _resource_record_post_action 06:26:09 INFO - [mozharness: 2016-10-06 13:26:09.579467Z] Finished run-tests step (success) 06:26:09 INFO - Running post-run listener: _resource_record_post_run 06:26:09 INFO - Total resource usage - Wall time: 1214s; CPU: 54.0%; Read bytes: 37393408; Write bytes: 708126720; Read time: 243; Write time: 1967 06:26:09 INFO - TinderboxPrint: CPU usage
53.9% 06:26:09 INFO - TinderboxPrint: I/O read bytes / time
37,393,408 / 243 06:26:09 INFO - TinderboxPrint: I/O write bytes / time
708,126,720 / 1,967 06:26:09 INFO - TinderboxPrint: CPU idle
2,239.7 (46.1%) 06:26:09 INFO - TinderboxPrint: CPU system
976.6 (20.1%) 06:26:09 INFO - TinderboxPrint: CPU user
1,641.4 (33.8%) 06:26:09 INFO - TinderboxPrint: Swap in / out
445,198,336 / 0 06:26:09 INFO - install - Wall time: 34s; CPU: 54.0%; Read bytes: 402323968; Write bytes: 397166592; Read time: 29699; Write time: 809 06:26:09 INFO - run-tests - Wall time: 1180s; CPU: 54.0%; Read bytes: 35267584; Write bytes: 295960576; Read time: 223; Write time: 1114 06:26:10 INFO - Running post-run listener: _upload_blobber_files 06:26:10 INFO - Blob upload gear active. 06:26:10 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 06:26:10 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 06:26:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 06:26:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 06:26:10 INFO - (blobuploader) - INFO - Open directory for files ... 06:26:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 06:26:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:26:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:26:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 06:26:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:26:11 INFO - (blobuploader) - INFO - Done attempting. 06:26:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 06:26:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:26:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:26:13 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 06:26:13 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:26:13 INFO - (blobuploader) - INFO - Done attempting. 06:26:13 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 06:26:13 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 06:26:13 INFO - (blobuploader) - INFO - Uploading, attempt #1. 06:26:15 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 06:26:15 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 06:26:15 INFO - (blobuploader) - INFO - Done attempting. 06:26:15 INFO - (blobuploader) - INFO - Iteration through files over. 06:26:15 INFO - Return code: 0 06:26:15 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 06:26:15 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 06:26:15 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/76c21248dd257b210fb1129cfd2a7a6804fda8677bbadac17c6d4d3d02f05cdd7d0c4160510acb830fc440625a352af8765d99791111166b7d30da167c11d963", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/833e18722c8876b8400b090de93ff3f3383ca6dcc7fa629ff3f5f21de0395f959c239806f5a66cad8e294baead4a3b4ef09a7e6ede3ddda944bea3ee894e7df1", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ed58423dd31fb115c989ebb6ec3fddb62f97fc00584e6becda60c5cfafbdb887e7e0e018e23f0a8a12fd722a4f18d13cc1af7f497f9242a9eb35a95d4d3e98c4"} 06:26:15 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 06:26:15 INFO - Writing to file /builds/slave/test/properties/blobber_files 06:26:15 INFO - Contents: 06:26:15 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/76c21248dd257b210fb1129cfd2a7a6804fda8677bbadac17c6d4d3d02f05cdd7d0c4160510acb830fc440625a352af8765d99791111166b7d30da167c11d963", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/833e18722c8876b8400b090de93ff3f3383ca6dcc7fa629ff3f5f21de0395f959c239806f5a66cad8e294baead4a3b4ef09a7e6ede3ddda944bea3ee894e7df1", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ed58423dd31fb115c989ebb6ec3fddb62f97fc00584e6becda60c5cfafbdb887e7e0e018e23f0a8a12fd722a4f18d13cc1af7f497f9242a9eb35a95d4d3e98c4"} 06:26:15 INFO - Running post-run listener: copy_logs_to_upload_dir 06:26:15 INFO - Copying logs to upload dir... 06:26:15 INFO - mkdir: /builds/slave/test/build/upload/logs 06:26:15 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1276.658671 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 16 secs) (at 2016-10-06 06:26:15.633091) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-06 06:26:15.636292) ========= 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.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners TMPDIR=/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/76c21248dd257b210fb1129cfd2a7a6804fda8677bbadac17c6d4d3d02f05cdd7d0c4160510acb830fc440625a352af8765d99791111166b7d30da167c11d963", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/833e18722c8876b8400b090de93ff3f3383ca6dcc7fa629ff3f5f21de0395f959c239806f5a66cad8e294baead4a3b4ef09a7e6ede3ddda944bea3ee894e7df1", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ed58423dd31fb115c989ebb6ec3fddb62f97fc00584e6becda60c5cfafbdb887e7e0e018e23f0a8a12fd722a4f18d13cc1af7f497f9242a9eb35a95d4d3e98c4"} build_url:https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg program finished with exit code 0 elapsedTime=0.011270 build_url: 'https://queue.taskcluster.net/v1/task/Q8veFJoySautg2jY420M6Q/artifacts/public/build/firefox-52.0a1.en-US.mac.dmg' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/76c21248dd257b210fb1129cfd2a7a6804fda8677bbadac17c6d4d3d02f05cdd7d0c4160510acb830fc440625a352af8765d99791111166b7d30da167c11d963", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/833e18722c8876b8400b090de93ff3f3383ca6dcc7fa629ff3f5f21de0395f959c239806f5a66cad8e294baead4a3b4ef09a7e6ede3ddda944bea3ee894e7df1", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/ed58423dd31fb115c989ebb6ec3fddb62f97fc00584e6becda60c5cfafbdb887e7e0e018e23f0a8a12fd722a4f18d13cc1af7f497f9242a9eb35a95d4d3e98c4"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-06 06:26:15.670004) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-06 06:26:15.670364) ========= 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.GYLV6Pnx1e/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.dFvWoYjX8t/Listeners TMPDIR=/var/folders/r7/1plmn1y93dqbchyb2n9pp0r800000w/T/ TWISTD_LOG_PATH=/builds/slave/twistd.log USER=cltbld VERSIONER_PYTHON_PREFER_32_BIT=no VERSIONER_PYTHON_VERSION=2.7 XPCOM_DEBUG_BREAK=warn XPC_FLAGS=0x0 XPC_SERVICE_NAME=0 __CF_USER_TEXT_ENCODING=0x1C:0:0 using PTY: False program finished with exit code 0 elapsedTime=0.004676 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-06 06:26:15.718944) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-06 06:26:15.719320) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-06 06:26:15.719767) ========= ========= Total master_lag: 0.17 =========