builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-045 starttime: 1481154785.4 results: success (0) buildid: 20161207140838 builduid: 992db8fc06914184a203cb0e4d6f44b9 revision: 9de9a34b6793b36218032a215178cc7ddbd66c98 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:05.402400) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:05.403236) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:05.403509) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:05.422774) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:05.423037) ========= 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: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1481151360.701757-1474587745 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-12-07 15:53:06-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 226M=0s 2016-12-07 15:53:06 (226 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.116071 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:05.554258) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:05.554963) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1481151360.701757-1474587745 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021858 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:05.605937) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:05.606330) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 9de9a34b6793b36218032a215178cc7ddbd66c98 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 9de9a34b6793b36218032a215178cc7ddbd66c98 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1481151360.701757-1474587745 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-12-07 15:53:06,846 truncating revision to first 12 chars 2016-12-07 15:53:06,847 Setting DEBUG logging. 2016-12-07 15:53:06,847 attempt 1/10 2016-12-07 15:53:06,847 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/9de9a34b6793?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-12-07 15:53:07,151 unpacking tar archive at: mozilla-aurora-9de9a34b6793/testing/mozharness/ program finished with exit code 0 elapsedTime=0.635992 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:06.256724) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:06.257040) ========= script_repo_revision: 9de9a34b6793b36218032a215178cc7ddbd66c98 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:06.257448) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:06.257710) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-07 15:53:06.267282) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-12-07 15:53:06.267544) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1481151360.701757-1474587745 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:53:07 INFO - MultiFileLogger online at 20161207 15:53:07 in /builds/slave/test 15:53:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 15:53:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:53:07 INFO - {'append_to_log': False, 15:53:07 INFO - 'base_work_dir': '/builds/slave/test', 15:53:07 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 15:53:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:53:07 INFO - 'branch': 'Mozilla-Aurora', 15:53:07 INFO - 'buildbot_json_path': 'buildprops.json', 15:53:07 INFO - 'config_files': ('talos/linux_config.py',), 15:53:07 INFO - 'default_actions': ('clobber', 15:53:07 INFO - 'read-buildbot-config', 15:53:07 INFO - 'download-and-extract', 15:53:07 INFO - 'populate-webroot', 15:53:07 INFO - 'create-virtualenv', 15:53:07 INFO - 'install', 15:53:07 INFO - 'run-tests'), 15:53:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:53:07 INFO - 'download_minidump_stackwalk': True, 15:53:07 INFO - 'download_symbols': 'ondemand', 15:53:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:53:07 INFO - 'tooltool.py': '/tools/tooltool.py', 15:53:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:53:07 INFO - '/tools/misc-python/virtualenv.py')}, 15:53:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:53:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:53:07 INFO - 'installer_path': 'installer.exe', 15:53:07 INFO - 'log_level': 'info', 15:53:07 INFO - 'log_name': 'talos', 15:53:07 INFO - 'log_to_console': True, 15:53:07 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:53:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:53:07 INFO - 'opt_config_files': (), 15:53:07 INFO - 'pip_index': False, 15:53:07 INFO - 'sps_profile': False, 15:53:07 INFO - 'sps_profile_interval': 0, 15:53:07 INFO - 'suite': 'dromaeojs-e10s', 15:53:07 INFO - 'system_bits': '32', 15:53:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:53:07 INFO - 'title': 'talos-linux64-ix-045', 15:53:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:53:07 INFO - 'use_talos_json': True, 15:53:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:53:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:53:07 INFO - 'work_dir': 'build'} 15:53:07 INFO - [mozharness: 2016-12-07 23:53:07.601495Z] Running clobber step. 15:53:07 INFO - Running pre-action listener: _resource_record_pre_action 15:53:07 INFO - Running main action method: clobber 15:53:07 INFO - rmtree: /builds/slave/test/build 15:53:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:53:08 INFO - Running post-action listener: _resource_record_post_action 15:53:08 INFO - [mozharness: 2016-12-07 23:53:08.582217Z] Finished clobber step (success) 15:53:08 INFO - [mozharness: 2016-12-07 23:53:08.582317Z] Running read-buildbot-config step. 15:53:08 INFO - Running pre-action listener: _resource_record_pre_action 15:53:08 INFO - Running main action method: read_buildbot_config 15:53:08 INFO - Using buildbot properties: 15:53:08 INFO - { 15:53:08 INFO - "project": "", 15:53:08 INFO - "product": "firefox", 15:53:08 INFO - "script_repo_revision": "production", 15:53:08 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 15:53:08 INFO - "repository": "", 15:53:08 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 15:53:08 INFO - "buildid": "20161207140838", 15:53:08 INFO - "pgo_build": "True", 15:53:08 INFO - "basedir": "/builds/slave/test", 15:53:08 INFO - "buildnumber": 736, 15:53:08 INFO - "slavename": "talos-linux64-ix-045", 15:53:08 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 15:53:08 INFO - "platform": "ubuntu64_hw", 15:53:08 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 15:53:08 INFO - "branch": "mozilla-aurora", 15:53:08 INFO - "repo_path": "releases/mozilla-aurora", 15:53:08 INFO - "revision": "9de9a34b6793b36218032a215178cc7ddbd66c98", 15:53:08 INFO - "stage_platform": "linux64-pgo", 15:53:08 INFO - "builduid": "992db8fc06914184a203cb0e4d6f44b9", 15:53:08 INFO - "slavebuilddir": "test" 15:53:08 INFO - } 15:53:08 INFO - Found installer url https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2. 15:53:08 INFO - Running post-action listener: _resource_record_post_action 15:53:08 INFO - [mozharness: 2016-12-07 23:53:08.584796Z] Finished read-buildbot-config step (success) 15:53:08 INFO - [mozharness: 2016-12-07 23:53:08.584885Z] Running download-and-extract step. 15:53:08 INFO - Running pre-action listener: _resource_record_pre_action 15:53:08 INFO - Running main action method: download_and_extract 15:53:08 INFO - mkdir: /builds/slave/test/build/tests 15:53:08 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')]} 15:53:08 INFO - trying https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 15:53:08 INFO - Downloading https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 15:53:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 15:53:09 INFO - Downloaded 1361 bytes. 15:53:09 INFO - Reading from file /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 15:53:09 INFO - Using the following test package requirements: 15:53:09 INFO - {u'common': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 15:53:09 INFO - u'cppunittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 15:53:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 15:53:09 INFO - u'gtest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 15:53:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.gtest.tests.zip'], 15:53:09 INFO - u'jittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 15:53:09 INFO - u'jsshell-linux-x86_64.zip'], 15:53:09 INFO - u'mochitest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 15:53:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 15:53:09 INFO - u'mozbase': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 15:53:09 INFO - u'reftest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 15:53:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.reftest.tests.zip'], 15:53:09 INFO - u'talos': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 15:53:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'], 15:53:09 INFO - u'web-platform': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 15:53:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 15:53:09 INFO - u'xpcshell': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 15:53:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 15:53:09 INFO - Downloading packages: [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 15:53:09 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 15:53:09 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:53:09 INFO - Fetch https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 15:53:09 INFO - Http code: 200 15:53:09 INFO - via: 1.1 5c2ff4ca1e447265402af29264e83497.cloudfront.net (CloudFront) 15:53:09 INFO - x-amz-cf-id: J9tU4g8IJuTgaQCN-k2EXTIiQYOZK8-hLe4cWAno2rr8HfBB4oBn4A== 15:53:09 INFO - x-amz-version-id: BV8bARojurC1A5ZbG.0U0fr4kjokQam6 15:53:09 INFO - Expected file size: 21954640 15:53:09 INFO - Obtained file size: 21954640 15:53:14 INFO - Downloading packages: [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 15:53:14 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 15:53:14 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:53:14 INFO - Fetch https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 15:53:14 INFO - Http code: 200 15:53:14 INFO - via: 1.1 b9a8ce441329f20cea895e08f19f1ec8.cloudfront.net (CloudFront) 15:53:14 INFO - x-amz-cf-id: jNryCEYiIy0_q3EP6sgGQf4QTvaCOAbjyj0_FgHg8F3ImB1TzXztbQ== 15:53:14 INFO - x-amz-version-id: BV8bARojurC1A5ZbG.0U0fr4kjokQam6 15:53:14 INFO - Expected file size: 21954640 15:53:14 INFO - Obtained file size: 21954640 15:53:19 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip 15:53:19 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 15:53:19 INFO - Fetch https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip into memory 15:53:19 INFO - Http code: 200 15:53:19 INFO - via: 1.1 9baadab4e4d95afe7af7bcba342b29c6.cloudfront.net (CloudFront) 15:53:19 INFO - x-amz-cf-id: KnQhh82RRy8DNToeQhlAgBtvDji9zkr5U1TA7Kt_uNWAZqTNXXZJCQ== 15:53:19 INFO - x-amz-version-id: 8.96ZGgURCPA5toSy5IoDBVxJuYE4.ym 15:53:20 INFO - Expected file size: 14409038 15:53:20 INFO - Obtained file size: 14409038 15:53:20 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')]} 15:53:20 INFO - trying https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 15:53:20 INFO - Downloading https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 15:53:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 15:53:21 INFO - Downloaded 63992416 bytes. 15:53:21 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 15:53:21 INFO - mkdir: /builds/slave/test/properties 15:53:21 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:53:21 INFO - Writing to file /builds/slave/test/properties/build_url 15:53:21 INFO - Contents: 15:53:21 INFO - build_url:https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 15:53:22 INFO - Running post-action listener: _resource_record_post_action 15:53:22 INFO - Running post-action listener: set_extra_try_arguments 15:53:22 INFO - [mozharness: 2016-12-07 23:53:22.063028Z] Finished download-and-extract step (success) 15:53:22 INFO - [mozharness: 2016-12-07 23:53:22.063128Z] Running populate-webroot step. 15:53:22 INFO - Running pre-action listener: _resource_record_pre_action 15:53:22 INFO - Running main action method: populate_webroot 15:53:22 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:53:22 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:53:22 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:53:22 INFO - '--tppagecycles', 15:53:22 INFO - '7'], 15:53:22 INFO - 'tests': ['tsvgm']}}, 15:53:22 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:53:22 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 15:53:22 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['dromaeo_css', 'kraken']}, 15:53:22 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 15:53:22 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:53:22 INFO - 'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:53:22 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:53:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:53:22 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:53:22 INFO - 'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['damp', 'tps']}, 15:53:22 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:53:22 INFO - 'tests': ['damp', 'tps']}, 15:53:22 INFO - 'g3': {'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['dromaeo_dom']}, 15:53:22 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:53:22 INFO - 'g4': {'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['basic_compositor_video']}, 15:53:22 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 15:53:22 INFO - 'other': {'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['a11yr', 15:53:22 INFO - 'ts_paint', 15:53:22 INFO - 'tpaint', 15:53:22 INFO - 'sessionrestore', 15:53:22 INFO - 'sessionrestore_no_auto_restore', 15:53:22 INFO - 'tabpaint']}, 15:53:22 INFO - 'other-e10s': {'tests': ['a11yr', 15:53:22 INFO - 'ts_paint', 15:53:22 INFO - 'tpaint', 15:53:22 INFO - 'sessionrestore', 15:53:22 INFO - 'sessionrestore_no_auto_restore', 15:53:22 INFO - 'tabpaint']}, 15:53:22 INFO - 'other-e10s_l64': {'tests': ['a11yr', 15:53:22 INFO - 'ts_paint', 15:53:22 INFO - 'tpaint', 15:53:22 INFO - 'sessionrestore', 15:53:22 INFO - 'sessionrestore_no_auto_restore', 15:53:22 INFO - 'tabpaint']}, 15:53:22 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 15:53:22 INFO - 'ts_paint', 15:53:22 INFO - 'tpaint', 15:53:22 INFO - 'sessionrestore', 15:53:22 INFO - 'sessionrestore_no_auto_restore', 15:53:22 INFO - 'tabpaint']}, 15:53:22 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['a11yr', 15:53:22 INFO - 'ts_paint', 15:53:22 INFO - 'tpaint', 15:53:22 INFO - 'sessionrestore', 15:53:22 INFO - 'sessionrestore_no_auto_restore', 15:53:22 INFO - 'tabpaint']}, 15:53:22 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['a11yr', 15:53:22 INFO - 'ts_paint', 15:53:22 INFO - 'tpaint', 15:53:22 INFO - 'sessionrestore', 15:53:22 INFO - 'sessionrestore_no_auto_restore', 15:53:22 INFO - 'tabpaint']}, 15:53:22 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['tsvgx', 15:53:22 INFO - 'tsvgr_opacity', 15:53:22 INFO - 'tart', 15:53:22 INFO - 'tscrollx', 15:53:22 INFO - 'cart']}, 15:53:22 INFO - 'svgr-e10s': {'tests': ['tsvgx', 15:53:22 INFO - 'tsvgr_opacity', 15:53:22 INFO - 'tart', 15:53:22 INFO - 'tscrollx', 15:53:22 INFO - 'cart']}, 15:53:22 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:53:22 INFO - 'talos_options': ['--disable-e10s'], 15:53:22 INFO - 'tests': ['tp5o']}, 15:53:22 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:53:22 INFO - 'tests': ['tp5o']}, 15:53:22 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:53:22 INFO - 'talos_options': ['--disable-e10s', 15:53:22 INFO - '--xperf_path', 15:53:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:53:22 INFO - 'tests': ['tp5n']}, 15:53:22 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:53:22 INFO - 'talos_options': ['--xperf_path', 15:53:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:53:22 INFO - 'tests': ['tp5n']}}, 15:53:22 INFO - 'talos.zip': {'path': '', 15:53:22 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:53:22 INFO - Running post-action listener: _resource_record_post_action 15:53:22 INFO - [mozharness: 2016-12-07 23:53:22.081777Z] Finished populate-webroot step (success) 15:53:22 INFO - [mozharness: 2016-12-07 23:53:22.081865Z] Running create-virtualenv step. 15:53:22 INFO - Running pre-action listener: _resource_record_pre_action 15:53:22 INFO - Running main action method: create_virtualenv 15:53:22 INFO - Creating virtualenv /builds/slave/test/build/venv 15:53: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 15:53:22 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:53:22 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:53:22 INFO - Using real prefix '/usr' 15:53:22 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:53:22 INFO - Installing distribute.............................................................................................................................................................................................done. 15:53:24 INFO - Installing pip.................done. 15:53:24 INFO - Return code: 0 15:53:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 15:53:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 15:53:24 INFO - Reading from file tmpfile_stdout 15:53:24 INFO - Output received: 15:53:24 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 15:53:24 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:53:24 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')]} 15:53:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:24 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')]} 15:53:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:24 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:24 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 15:53:24 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 15:53:24 INFO - Using env: {'DISPLAY': ':0', 15:53:24 INFO - 'HOME': '/home/cltbld', 15:53:24 INFO - 'LANG': 'en_US.UTF-8', 15:53:24 INFO - 'LANGUAGE': 'en_US:en', 15:53:24 INFO - 'LOGNAME': 'cltbld', 15:53:24 INFO - 'MAIL': '/var/mail/cltbld', 15:53:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:24 INFO - 'MOZ_NO_REMOTE': '1', 15:53:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:24 INFO - 'NO_EM_RESTART': '1', 15:53:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:24 INFO - 'PWD': '/builds/slave/test', 15:53:24 INFO - 'SHELL': '/bin/bash', 15:53:24 INFO - 'SHLVL': '1', 15:53:24 INFO - 'TERM': 'linux', 15:53:24 INFO - 'TMOUT': '86400', 15:53:24 INFO - 'USER': 'cltbld', 15:53:24 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:24 INFO - '_': '/tools/buildbot/bin/python'} 15:53:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:25 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 15:53:25 INFO - Cleaning up... 15:53:25 INFO - Return code: 0 15:53:25 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 15:53:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:53:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:53:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:25 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:25 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 15:53:25 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 15:53:25 INFO - Using env: {'DISPLAY': ':0', 15:53:25 INFO - 'HOME': '/home/cltbld', 15:53:25 INFO - 'LANG': 'en_US.UTF-8', 15:53:25 INFO - 'LANGUAGE': 'en_US:en', 15:53:25 INFO - 'LOGNAME': 'cltbld', 15:53:25 INFO - 'MAIL': '/var/mail/cltbld', 15:53:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:25 INFO - 'MOZ_NO_REMOTE': '1', 15:53:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:25 INFO - 'NO_EM_RESTART': '1', 15:53:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:25 INFO - 'PWD': '/builds/slave/test', 15:53:25 INFO - 'SHELL': '/bin/bash', 15:53:25 INFO - 'SHLVL': '1', 15:53:25 INFO - 'TERM': 'linux', 15:53:25 INFO - 'TMOUT': '86400', 15:53:25 INFO - 'USER': 'cltbld', 15:53:25 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:25 INFO - '_': '/tools/buildbot/bin/python'} 15:53:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:25 INFO - Downloading/unpacking psutil>=3.1.1 15:53:25 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 15:53:25 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 15:53:25 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 15:53:25 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 15:53:25 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 15:53:25 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 15:53:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:53:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:53:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:53:27 INFO - Installing collected packages: psutil 15:53:27 INFO - Running setup.py install for psutil 15:53:27 INFO - building 'psutil._psutil_linux' extension 15:53:27 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 15:53:27 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 15:53:27 INFO - building 'psutil._psutil_posix' extension 15:53:27 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 15:53:27 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 15:53:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:53:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:53:27 INFO - Successfully installed psutil 15:53:27 INFO - Cleaning up... 15:53:27 INFO - Return code: 0 15:53:27 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 15:53:27 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')]} 15:53:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:27 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')]} 15:53:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:27 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:27 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 15:53:27 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 15:53:27 INFO - Using env: {'DISPLAY': ':0', 15:53:27 INFO - 'HOME': '/home/cltbld', 15:53:27 INFO - 'LANG': 'en_US.UTF-8', 15:53:27 INFO - 'LANGUAGE': 'en_US:en', 15:53:27 INFO - 'LOGNAME': 'cltbld', 15:53:27 INFO - 'MAIL': '/var/mail/cltbld', 15:53:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:27 INFO - 'MOZ_NO_REMOTE': '1', 15:53:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:27 INFO - 'NO_EM_RESTART': '1', 15:53:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:27 INFO - 'PWD': '/builds/slave/test', 15:53:27 INFO - 'SHELL': '/bin/bash', 15:53:27 INFO - 'SHLVL': '1', 15:53:27 INFO - 'TERM': 'linux', 15:53:27 INFO - 'TMOUT': '86400', 15:53:27 INFO - 'USER': 'cltbld', 15:53:27 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:27 INFO - '_': '/tools/buildbot/bin/python'} 15:53:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:28 INFO - Downloading/unpacking mozsystemmonitor==0.3 15:53:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:53:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:53:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:53:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:53:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:53:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:53:30 INFO - Downloading mozsystemmonitor-0.3.tar.gz 15:53:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:53:30 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 15:53:30 INFO - Installing collected packages: mozsystemmonitor 15:53:30 INFO - Running setup.py install for mozsystemmonitor 15:53:30 INFO - Successfully installed mozsystemmonitor 15:53:30 INFO - Cleaning up... 15:53:30 INFO - Return code: 0 15:53:30 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 15:53:30 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')]} 15:53:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:30 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')]} 15:53:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:30 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:30 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 15:53:30 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 15:53:30 INFO - Using env: {'DISPLAY': ':0', 15:53:30 INFO - 'HOME': '/home/cltbld', 15:53:30 INFO - 'LANG': 'en_US.UTF-8', 15:53:30 INFO - 'LANGUAGE': 'en_US:en', 15:53:30 INFO - 'LOGNAME': 'cltbld', 15:53:30 INFO - 'MAIL': '/var/mail/cltbld', 15:53:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:30 INFO - 'MOZ_NO_REMOTE': '1', 15:53:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:30 INFO - 'NO_EM_RESTART': '1', 15:53:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:30 INFO - 'PWD': '/builds/slave/test', 15:53:30 INFO - 'SHELL': '/bin/bash', 15:53:30 INFO - 'SHLVL': '1', 15:53:30 INFO - 'TERM': 'linux', 15:53:30 INFO - 'TMOUT': '86400', 15:53:30 INFO - 'USER': 'cltbld', 15:53:30 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:30 INFO - '_': '/tools/buildbot/bin/python'} 15:53:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:30 INFO - Downloading/unpacking jsonschema==2.5.1 15:53:30 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 15:53:30 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 15:53:30 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 15:53:30 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 15:53:30 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 15:53:30 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 15:53:32 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:53:32 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 15:53: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 15:53: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 15:53: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 15:53: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 15:53: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 15:53: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 15:53:32 INFO - Downloading functools32-3.2.3-2.tar.gz 15:53:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:53:32 INFO - warning: no files found matching '*.txt' 15:53:32 INFO - no previously-included directories found matching 'build' 15:53:32 INFO - no previously-included directories found matching 'dist' 15:53:32 INFO - no previously-included directories found matching '.git*' 15:53:32 INFO - Installing collected packages: jsonschema, functools32 15:53:32 INFO - Running setup.py install for functools32 15:53:32 INFO - warning: no files found matching '*.txt' 15:53:32 INFO - no previously-included directories found matching 'build' 15:53:32 INFO - no previously-included directories found matching 'dist' 15:53:32 INFO - no previously-included directories found matching '.git*' 15:53:32 INFO - Successfully installed jsonschema functools32 15:53:32 INFO - Cleaning up... 15:53:33 INFO - Return code: 0 15:53:33 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 15:53:33 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')]} 15:53:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:33 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')]} 15:53:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:33 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:33 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 15:53:33 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 15:53:33 INFO - Using env: {'DISPLAY': ':0', 15:53:33 INFO - 'HOME': '/home/cltbld', 15:53:33 INFO - 'LANG': 'en_US.UTF-8', 15:53:33 INFO - 'LANGUAGE': 'en_US:en', 15:53:33 INFO - 'LOGNAME': 'cltbld', 15:53:33 INFO - 'MAIL': '/var/mail/cltbld', 15:53:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:33 INFO - 'MOZ_NO_REMOTE': '1', 15:53:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:33 INFO - 'NO_EM_RESTART': '1', 15:53:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:33 INFO - 'PWD': '/builds/slave/test', 15:53:33 INFO - 'SHELL': '/bin/bash', 15:53:33 INFO - 'SHLVL': '1', 15:53:33 INFO - 'TERM': 'linux', 15:53:33 INFO - 'TMOUT': '86400', 15:53:33 INFO - 'USER': 'cltbld', 15:53:33 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:33 INFO - '_': '/tools/buildbot/bin/python'} 15:53:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:33 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 15:53:33 INFO - Cleaning up... 15:53:33 INFO - Return code: 0 15:53:33 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:53:33 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')]} 15:53:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:33 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')]} 15:53:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:33 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:33 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 15:53:33 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 15:53:33 INFO - Using env: {'DISPLAY': ':0', 15:53:33 INFO - 'HOME': '/home/cltbld', 15:53:33 INFO - 'LANG': 'en_US.UTF-8', 15:53:33 INFO - 'LANGUAGE': 'en_US:en', 15:53:33 INFO - 'LOGNAME': 'cltbld', 15:53:33 INFO - 'MAIL': '/var/mail/cltbld', 15:53:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:33 INFO - 'MOZ_NO_REMOTE': '1', 15:53:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:33 INFO - 'NO_EM_RESTART': '1', 15:53:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:33 INFO - 'PWD': '/builds/slave/test', 15:53:33 INFO - 'SHELL': '/bin/bash', 15:53:33 INFO - 'SHLVL': '1', 15:53:33 INFO - 'TERM': 'linux', 15:53:33 INFO - 'TMOUT': '86400', 15:53:33 INFO - 'USER': 'cltbld', 15:53:33 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:33 INFO - '_': '/tools/buildbot/bin/python'} 15:53:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:33 INFO - Downloading/unpacking blobuploader==1.2.4 15:53:33 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 15:53:33 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 15:53:33 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 15:53:33 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 15:53:33 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 15:53:33 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 15:53:35 INFO - Downloading blobuploader-1.2.4.tar.gz 15:53:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:53:35 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:53: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 15:53: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 15:53: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 15:53: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 15:53: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 15:53: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 15:53:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:53:35 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:53: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 15:53: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 15:53: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 15:53: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 15:53: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 15:53: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 15:53:36 INFO - Downloading docopt-0.6.1.tar.gz 15:53:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:53:36 INFO - Installing collected packages: blobuploader, requests, docopt 15:53:36 INFO - Running setup.py install for blobuploader 15:53:36 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:53:36 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:53:36 INFO - Running setup.py install for requests 15:53:36 INFO - Running setup.py install for docopt 15:53:36 INFO - Successfully installed blobuploader requests docopt 15:53:36 INFO - Cleaning up... 15:53:36 INFO - Return code: 0 15:53:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:53:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:53:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:36 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:36 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 15:53:36 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 15:53:36 INFO - Using env: {'DISPLAY': ':0', 15:53:36 INFO - 'HOME': '/home/cltbld', 15:53:36 INFO - 'LANG': 'en_US.UTF-8', 15:53:36 INFO - 'LANGUAGE': 'en_US:en', 15:53:36 INFO - 'LOGNAME': 'cltbld', 15:53:36 INFO - 'MAIL': '/var/mail/cltbld', 15:53:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:36 INFO - 'MOZ_NO_REMOTE': '1', 15:53:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:36 INFO - 'NO_EM_RESTART': '1', 15:53:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:36 INFO - 'PWD': '/builds/slave/test', 15:53:36 INFO - 'SHELL': '/bin/bash', 15:53:36 INFO - 'SHLVL': '1', 15:53:36 INFO - 'TERM': 'linux', 15:53:36 INFO - 'TMOUT': '86400', 15:53:36 INFO - 'USER': 'cltbld', 15:53:36 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:36 INFO - '_': '/tools/buildbot/bin/python'} 15:53:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:53:37 INFO - Running setup.py (path:/tmp/pip-TnYPsh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:53:37 INFO - Running setup.py (path:/tmp/pip-W0lPxt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:53:37 INFO - Running setup.py (path:/tmp/pip-gNMS8a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:53:37 INFO - Running setup.py (path:/tmp/pip-BOReGq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:53:37 INFO - Running setup.py (path:/tmp/pip-SLKPpp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:53:37 INFO - Running setup.py (path:/tmp/pip-nfVmqB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:53:37 INFO - Running setup.py (path:/tmp/pip-nFj9Ng-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:53:37 INFO - Running setup.py (path:/tmp/pip-H9T1Du-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:53:37 INFO - Running setup.py (path:/tmp/pip-TBOIiV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:53:37 INFO - Running setup.py (path:/tmp/pip-Z12WSJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:53:37 INFO - Running setup.py (path:/tmp/pip-M0OKQy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:53:37 INFO - Running setup.py (path:/tmp/pip-7UEyxK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:53:37 INFO - Running setup.py (path:/tmp/pip-_XYLbr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:53:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:53:37 INFO - Running setup.py (path:/tmp/pip-yAXQP3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:53:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:53:38 INFO - Running setup.py (path:/tmp/pip-cV3dH5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:53:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:53:38 INFO - Running setup.py (path:/tmp/pip-0ywSnB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:53:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:53:38 INFO - Running setup.py (path:/tmp/pip-fIAyda-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:53:38 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:53:38 INFO - Running setup.py install for manifestparser 15:53:38 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:53:38 INFO - Running setup.py install for mozcrash 15:53:38 INFO - Running setup.py install for mozdebug 15:53:38 INFO - Running setup.py install for mozdevice 15:53:38 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:53:38 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:53:38 INFO - Running setup.py install for mozfile 15:53:38 INFO - Running setup.py install for mozhttpd 15:53:38 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:53:38 INFO - Running setup.py install for mozinfo 15:53:38 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:53:38 INFO - Running setup.py install for mozInstall 15:53:39 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Running setup.py install for mozleak 15:53:39 INFO - Running setup.py install for mozlog 15:53:39 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Running setup.py install for moznetwork 15:53:39 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Running setup.py install for mozprocess 15:53:39 INFO - Running setup.py install for mozprofile 15:53:39 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Running setup.py install for mozrunner 15:53:39 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:53:39 INFO - Running setup.py install for mozscreenshot 15:53:39 INFO - Running setup.py install for moztest 15:53:39 INFO - Running setup.py install for mozversion 15:53:40 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:53:40 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:53:40 INFO - Cleaning up... 15:53:40 INFO - Return code: 0 15:53:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:53:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:53:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:53:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:40 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:40 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 15:53:40 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 15:53:40 INFO - Using env: {'DISPLAY': ':0', 15:53:40 INFO - 'HOME': '/home/cltbld', 15:53:40 INFO - 'LANG': 'en_US.UTF-8', 15:53:40 INFO - 'LANGUAGE': 'en_US:en', 15:53:40 INFO - 'LOGNAME': 'cltbld', 15:53:40 INFO - 'MAIL': '/var/mail/cltbld', 15:53:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:40 INFO - 'MOZ_NO_REMOTE': '1', 15:53:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:40 INFO - 'NO_EM_RESTART': '1', 15:53:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:40 INFO - 'PWD': '/builds/slave/test', 15:53:40 INFO - 'SHELL': '/bin/bash', 15:53:40 INFO - 'SHLVL': '1', 15:53:40 INFO - 'TERM': 'linux', 15:53:40 INFO - 'TMOUT': '86400', 15:53:40 INFO - 'USER': 'cltbld', 15:53:40 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:40 INFO - '_': '/tools/buildbot/bin/python'} 15:53:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:53:40 INFO - Running setup.py (path:/tmp/pip-3u4Nnb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:53:40 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)) 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:53:40 INFO - Running setup.py (path:/tmp/pip-aumR7p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:53:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:53:40 INFO - Running setup.py (path:/tmp/pip-8tbW0I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:53:40 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)) 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:53:40 INFO - Running setup.py (path:/tmp/pip-BSuuLD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:53:40 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)) 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:53:40 INFO - Running setup.py (path:/tmp/pip-qdF5k6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:53:40 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)) 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:53:40 INFO - Running setup.py (path:/tmp/pip-83PfX5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:53:40 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)) 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:53:40 INFO - Running setup.py (path:/tmp/pip-zRoLi9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:53:40 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)) 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:53:40 INFO - Running setup.py (path:/tmp/pip-YNzm2L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:53:40 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)) 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:53:40 INFO - Running setup.py (path:/tmp/pip-7v6Kon-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:53:40 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)) 15:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:53:40 INFO - Running setup.py (path:/tmp/pip-YlC289-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:53:41 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)) 15:53:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:53:41 INFO - Running setup.py (path:/tmp/pip-H06hug-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:53:41 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)) 15:53:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:53:41 INFO - Running setup.py (path:/tmp/pip-BpHj5C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:53:41 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)) 15:53:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:53:41 INFO - Running setup.py (path:/tmp/pip-IREwUW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:53:41 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)) 15:53:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:53:41 INFO - Running setup.py (path:/tmp/pip-RTMhL2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:53:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 15:53:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:53:41 INFO - Running setup.py (path:/tmp/pip-N5aPz1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:53:41 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)) 15:53:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:53:41 INFO - Running setup.py (path:/tmp/pip-GBpv5W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:53:41 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)) 15:53:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:53:41 INFO - Running setup.py (path:/tmp/pip-Njv90O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:53:41 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)) 15:53:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:53:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:53:41 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)) 15:53:41 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)) 15:53:41 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)) 15:53:41 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:53: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 15:53: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 15:53: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 15:53: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 15:53: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 15:53: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 15:53:43 INFO - Downloading blessings-1.6.tar.gz 15:53:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:53:43 INFO - Installing collected packages: blessings 15:53:43 INFO - Running setup.py install for blessings 15:53:43 INFO - Successfully installed blessings 15:53:43 INFO - Cleaning up... 15:53:43 INFO - Return code: 0 15:53:43 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:53:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:53:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:53:43 INFO - Reading from file tmpfile_stdout 15:53:43 INFO - Current package versions: 15:53:43 INFO - argparse == 1.2.1 15:53:43 INFO - blessings == 1.6 15:53:43 INFO - blobuploader == 1.2.4 15:53:43 INFO - docopt == 0.6.1 15:53:43 INFO - functools32 == 3.2.3-2 15:53:43 INFO - jsonschema == 2.5.1 15:53:43 INFO - manifestparser == 1.1 15:53:43 INFO - mozInstall == 1.12 15:53:43 INFO - mozcrash == 1.0 15:53:43 INFO - mozdebug == 0.1 15:53:43 INFO - mozdevice == 0.48 15:53:43 INFO - mozfile == 1.2 15:53:43 INFO - mozhttpd == 0.7 15:53:43 INFO - mozinfo == 0.9 15:53:43 INFO - mozleak == 0.1 15:53:43 INFO - mozlog == 3.4 15:53:43 INFO - moznetwork == 0.27 15:53:43 INFO - mozprocess == 0.23 15:53:43 INFO - mozprofile == 0.28 15:53:43 INFO - mozrunner == 6.13 15:53:43 INFO - mozscreenshot == 0.1 15:53:43 INFO - mozsystemmonitor == 0.3 15:53:43 INFO - moztest == 0.7 15:53:43 INFO - mozversion == 1.4 15:53:43 INFO - psutil == 3.1.1 15:53:43 INFO - requests == 1.2.3 15:53:43 INFO - wsgiref == 0.1.2 15:53:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:53: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')]} 15:53:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53: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')]} 15:53:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:44 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:44 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 15:53:44 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 15:53:44 INFO - Using env: {'DISPLAY': ':0', 15:53:44 INFO - 'HOME': '/home/cltbld', 15:53:44 INFO - 'LANG': 'en_US.UTF-8', 15:53:44 INFO - 'LANGUAGE': 'en_US:en', 15:53:44 INFO - 'LOGNAME': 'cltbld', 15:53:44 INFO - 'MAIL': '/var/mail/cltbld', 15:53:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:44 INFO - 'MOZ_NO_REMOTE': '1', 15:53:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:44 INFO - 'NO_EM_RESTART': '1', 15:53:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:44 INFO - 'PWD': '/builds/slave/test', 15:53:44 INFO - 'SHELL': '/bin/bash', 15:53:44 INFO - 'SHLVL': '1', 15:53:44 INFO - 'TERM': 'linux', 15:53:44 INFO - 'TMOUT': '86400', 15:53:44 INFO - 'USER': 'cltbld', 15:53:44 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:44 INFO - '_': '/tools/buildbot/bin/python'} 15:53:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:44 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)) 15:53:44 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)) 15:53:44 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)) 15:53:44 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)) 15:53:44 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)) 15:53:44 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)) 15:53:44 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)) 15:53:44 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)) 15:53:44 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)) 15:53:44 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)) 15:53:44 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)) 15:53:44 INFO - Cleaning up... 15:53:44 INFO - Return code: 0 15:53:44 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:53:44 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')]} 15:53:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:53:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:44 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')]} 15:53:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:53:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:53:44 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 0x7f41beb54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19b08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a7dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 15:53:44 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 15:53:44 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 15:53:44 INFO - Using env: {'DISPLAY': ':0', 15:53:44 INFO - 'HOME': '/home/cltbld', 15:53:44 INFO - 'LANG': 'en_US.UTF-8', 15:53:44 INFO - 'LANGUAGE': 'en_US:en', 15:53:44 INFO - 'LOGNAME': 'cltbld', 15:53:44 INFO - 'MAIL': '/var/mail/cltbld', 15:53:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:53:44 INFO - 'MOZ_NO_REMOTE': '1', 15:53:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:53:44 INFO - 'NO_EM_RESTART': '1', 15:53:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:53:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:53:44 INFO - 'PWD': '/builds/slave/test', 15:53:44 INFO - 'SHELL': '/bin/bash', 15:53:44 INFO - 'SHLVL': '1', 15:53:44 INFO - 'TERM': 'linux', 15:53:44 INFO - 'TMOUT': '86400', 15:53:44 INFO - 'USER': 'cltbld', 15:53:44 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:53:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:53:44 INFO - '_': '/tools/buildbot/bin/python'} 15:53:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:53:44 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 15:53:44 INFO - Cleaning up... 15:53:44 INFO - Return code: 0 15:53:44 INFO - Running post-action listener: _resource_record_post_action 15:53:44 INFO - Running post-action listener: _start_resource_monitoring 15:53:44 INFO - Starting resource monitoring. 15:53:44 INFO - [mozharness: 2016-12-07 23:53:44.481348Z] Finished create-virtualenv step (success) 15:53:44 INFO - [mozharness: 2016-12-07 23:53:44.481814Z] Running install step. 15:53:44 INFO - Running pre-action listener: _resource_record_pre_action 15:53:44 INFO - Running main action method: install 15:53:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:53:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:53:44 INFO - Reading from file tmpfile_stdout 15:53:44 INFO - Detecting whether we're running mozinstall >=1.0... 15:53:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:53:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:53:44 INFO - Reading from file tmpfile_stdout 15:53:44 INFO - Output received: 15:53:44 INFO - Usage: mozinstall [options] installer 15:53:44 INFO - Options: 15:53:44 INFO - -h, --help show this help message and exit 15:53:44 INFO - -d DEST, --destination=DEST 15:53:44 INFO - Directory to install application into. [default: 15:53:44 INFO - "/builds/slave/test"] 15:53:44 INFO - --app=APP Application being installed. [default: firefox] 15:53:44 INFO - mkdir: /builds/slave/test/build/application 15:53:44 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 15:53:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 15:54:00 INFO - Reading from file tmpfile_stdout 15:54:00 INFO - Output received: 15:54:00 INFO - /builds/slave/test/build/application/firefox/firefox 15:54:00 INFO - Running post-action listener: _resource_record_post_action 15:54:00 INFO - [mozharness: 2016-12-07 23:54:00.728692Z] Finished install step (success) 15:54:00 INFO - [mozharness: 2016-12-07 23:54:00.728941Z] Running run-tests step. 15:54:00 INFO - Running pre-action listener: _resource_record_pre_action 15:54:00 INFO - Running main action method: run_tests 15:54:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:54:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:54:00 INFO - Python 2.7.3 15:54:00 INFO - Return code: 0 15:54:00 INFO - grabbing minidump binary from tooltool 15:54:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:54:00 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/linux64/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 0x1a7af60>, '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 0x1a7bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1a7c1d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:54:00 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/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 15:54:00 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/linux64/releng.manifest -o -c /builds/tooltool_cache 15:54:00 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/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 15:54:00 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:54:00 INFO - Return code: 0 15:54:00 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 15:54:00 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:54:00 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:54:00 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 15:54:00 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:54:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 15:54:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-045 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 15:54:00 INFO - Using env: {'DISPLAY': ':0', 15:54:00 INFO - 'HOME': '/home/cltbld', 15:54:00 INFO - 'LANG': 'en_US.UTF-8', 15:54:00 INFO - 'LANGUAGE': 'en_US:en', 15:54:00 INFO - 'LOGNAME': 'cltbld', 15:54:00 INFO - 'MAIL': '/var/mail/cltbld', 15:54:00 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:54:00 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:54:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:54:00 INFO - 'MOZ_NO_REMOTE': '1', 15:54:00 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:54:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:54:00 INFO - 'NO_EM_RESTART': '1', 15:54:00 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:54:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:54:00 INFO - 'PWD': '/builds/slave/test', 15:54:00 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:54:00 INFO - 'SHELL': '/bin/bash', 15:54:00 INFO - 'SHLVL': '1', 15:54:00 INFO - 'TERM': 'linux', 15:54:00 INFO - 'TMOUT': '86400', 15:54:00 INFO - 'USER': 'cltbld', 15:54:00 INFO - 'XDG_SESSION_COOKIE': '4300f881736b422476174874000001bc-1481151360.701757-1474587745', 15:54:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:54:00 INFO - '_': '/tools/buildbot/bin/python'} 15:54:00 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-045', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 15:54:01 INFO - mozversion application_buildid: 20161207140838 15:54:01 INFO - mozversion application_changeset: 9de9a34b6793b36218032a215178cc7ddbd66c98 15:54:01 INFO - mozversion application_display_name: FirefoxDeveloperEdition 15:54:01 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:54:01 INFO - mozversion application_name: Firefox 15:54:01 INFO - mozversion application_remotingname: firefox-dev 15:54:01 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 15:54:01 INFO - mozversion application_vendor: Mozilla 15:54:01 INFO - mozversion application_version: 52.0a2 15:54:01 INFO - mozversion platform_buildid: 20161207140838 15:54:01 INFO - mozversion platform_changeset: 9de9a34b6793b36218032a215178cc7ddbd66c98 15:54:01 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 15:54:01 INFO - mozversion platform_version: 52.0a2 15:54:01 INFO - using testdate: 1481154841 15:54:01 INFO - actual date: 1481154841 15:54:01 INFO - starting webserver on 'localhost:58730' 15:54:01 INFO - SUITE-START | Running 2 tests 15:54:01 INFO - TEST-START | dromaeo_css 15:54:01 INFO - operating with platform_type : linux_ 15:54:01 INFO - Initialising browser for dromaeo_css test... 15:54:01 INFO - TEST-INFO | started process 19512 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpa7FCWd/profile http://localhost:58730/getInfo.html) 15:54:05 INFO - PROCESS | 19512 | __metrics Screen width/height:1600/1200 15:54:05 INFO - PROCESS | 19512 | colorDepth:24 15:54:05 INFO - PROCESS | 19512 | Browser inner width/height: 1024/697 15:54:05 INFO - PROCESS | 19512 | __metrics 15:54:06 ERROR - PROCESS | 19512 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3175: TypeError: this.tabs is undefined 15:54:07 INFO - TEST-INFO | 19512: exit 0 15:54:07 INFO - Browser initialized. 15:54:07 INFO - Running cycle 1/1 for dromaeo_css test... 15:54:07 INFO - TEST-INFO | started process 19641 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpa7FCWd/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:54:18 INFO - PROCESS | 19641 | RSS: Main: 151650304 15:54:18 INFO - PROCESS | 19641 | 15:55:08 INFO - PROCESS | 19641 | 1481154908548 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] 15:57:19 INFO - PROCESS | 19641 | Cycle 1(1): loaded http://localhost:58730/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58730/tests/dromaeo/cssquery-ext.html) 15:57:20 INFO - PROCESS | 19641 | RSS: Main: 156631040 15:57:20 INFO - PROCESS | 19641 | 16:00:22 INFO - PROCESS | 19641 | Cycle 1(1): loaded http://localhost:58730/tests/dromaeo/cssquery-ext.html (next: http://localhost:58730/tests/dromaeo/cssquery-jquery.html) 16:00:23 INFO - PROCESS | 19641 | RSS: Main: 153128960 16:00:23 INFO - PROCESS | 19641 | 16:03:24 INFO - PROCESS | 19641 | Cycle 1(1): loaded http://localhost:58730/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58730/tests/dromaeo/cssquery-mootools.html) 16:03:25 INFO - PROCESS | 19641 | RSS: Main: 153776128 16:03:25 INFO - PROCESS | 19641 | 16:06:27 INFO - PROCESS | 19641 | Cycle 1(1): loaded http://localhost:58730/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58730/tests/dromaeo/cssquery-prototype.html) 16:06:27 INFO - PROCESS | 19641 | RSS: Main: 152014848 16:06:27 INFO - PROCESS | 19641 | 16:09:30 INFO - PROCESS | 19641 | Cycle 1(1): loaded http://localhost:58730/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58730/tests/dromaeo/cssquery-yui.html) 16:09:31 INFO - PROCESS | 19641 | RSS: Main: 154918912 16:09:31 INFO - PROCESS | 19641 | 16:12:33 INFO - PROCESS | 19641 | Cycle 1(1): loaded http://localhost:58730/tests/dromaeo/cssquery-yui.html (next: http://localhost:58730/tests/dromaeo/cssquery-dojo.html) 16:12:33 INFO - PROCESS | 19641 | RSS: Main: 155422720 16:12:33 INFO - PROCESS | 19641 | 16:12:33 INFO - PROCESS | 19641 | __start_tp_report 16:12:33 INFO - PROCESS | 19641 | _x_x_mozilla_page_load 16:12:33 INFO - PROCESS | 19641 | _x_x_mozilla_page_load_details 16:12:33 INFO - PROCESS | 19641 | |i|pagename|runs| 16:12:33 INFO - PROCESS | 19641 | |0;dojo.html;3289.42435073862;3319.6348401675828;3323.9002829915103;3331.0173498817862;3341.198112453012;5792.594518383709;5805.970970145143;5850.063989761639;5854.7658093676255;5880.353161152275;5796.30444346679;5835.708214589275;5838.970805145968;5864.149698293745;5865.032269675509;5277.12927366984;5296.867578310535;5329.600279978998;5346.198070289449;5356.91964620531;5371.355437347524;5376.086065368897;5379.784808607651;5395.028894798935;5402.162664786944;5159.948400515985;5171.3535808024;5329.067413202693;5372.865678358034;5387.730613469331;5262.973685131569;5286.127788914843;5343.706096164709;5389.326334208224;5435.157550579666;5274.657147285414;5344.198370244456;5369.114096174127;5373.194020896858;5380.488853558905;5588.552915766729;5800.941990580124;5860.912086318709;5873.207117039187;5914.556408269354;6109.3890610939;6120.355709576858;6158.784442544535;6179.351168127372;6207.844803879894;6217.378262173792;6229.87540249197;6239.563230573862;6322.58903171297;6324.968375158141;5907;5907.793227237069;5907.852303692356;5912.881742365129;5938.317093534256;6235.158253635792;6261.874762504815;6314.494840412756;6381.1385462962835;6417.262014868256;6155.446009859134;6161.322254551996;6166.414190651881;6167.352427995085;6168.506519478431;5994.250718660168;6070.514358851281;6247.094171345129;6264.123022776815;6272.6236425814595;6135.723892424851;6150.50795936324;6154.446099851035;6252.218472690914;6260.812175634738;6217.564770466114;6229.034499652561;6231.189945307172;6250.968745156245;6281.748730050838;4668.696534725232;4793.856184314476;4848.8302909398;4851.466338702739;4856.39295088114;4174.666026717855;4193.1404062167185;4226.915461690749;4227.957720422818;4320.589543993316;5945.494632956247;5951.077582974646;5974.103884417372;5976.491998180117;5980.760769569256;6319.368063193644;6320.652364120017;6324.71538780756;6336;6341.936580634227;5750.1949727038245;5811.767529298865;5913.172155898178;5922.733476993546;5966.791162309385;5445.264889239981;5446.019716451076;5449.01917654818;5452.182172674051;5471.206675032098;6371.776987805404;6440.677966101676;6499.642519661464;6518.28298887122;6545.345465453416;6103.542234332532;6125.784909797739;6156.138140660221;6205.286392064971;6318.778842740482;6485.643289618927;6496.382843629847;6497.155369802084;6497.642629655415;6502.479801615954;6170.56806023592;6193.84515387119;6203.286622038523;6207.782727604693;6208.25500939872;6013.548983826318;6133.141360209485;6140.84169297792;6329.841753956188;6330.240371155307;5997.520198384206;6120.718041849287;6133.355997620364;6152.354002829818;6157.507399407947;6105.693442272482;6110.984061328523;6114.571104522668;6115.635867915642;6122.611623597813;5833.358330583717;5888.852778680567;6013.428724271187;6086.391360863879;6097.054956481752;6122.326544080237;6141.179174348115;6154.046122850965;6235.501159907106;6241.188645476059;6047.758089676539;6051.425114614105;6082.513398927987;6085.57400981927;6092.75628974836 16:12:33 INFO - PROCESS | 19641 | |1;ext.html;580.3702982264243;612.0727098445856;620.1256228717508;675.1122274209414;681.6285124607089;44398.55601443985;45048.09903801922;45507.31739023917;49730.50269497304;49815.25277120846;45610.543894561044;45680.0863982721;46036;46253;46272.53727462724;8739.257163141141;8809.38334316598;8818.64725410986;8824.161704638049;8863.689770858022;8754.912450875474;8773.64905403783;8831.47011179328;8840.38117331787;8889.377743557954;8811.735647930573;8840.425372350808;8900.821983560325;8903.688370907019;8921.33090018248;8809.075047120055;8834.249088827457;8862.955685221597;8872.556372181365;8874.822503549893;8595.3553483489;8729.258013068897;8734.12658734128;8753.518556479392;8771.956140219258;42784;42827.785861070806;42995.35506967398;43163.784181078896;43312.35031474499;3704.8888533344043;3813.237352529505;3823.9808800956093;4401.427814384142;4490.640748740093;32746.62096521083;32768.83615581931;32962.50556241658;32977.83511082453;34108.48837267443;4237.555056719031;4237.788110594489;4244;4319.892002699926;4324.070324880166;366504;376609;376849;561456;561603.9112959666;61471.07793383103;61725.69137154285;61736.69131654313;61923;61925;39690;40495.79752101221;66165.66917165383;66638;66777.33222667809;19038.428847134608;19160.71258931117;19303.4208973731;19402.8059719401;19522.414327570197;14845.703085938221;15029.323680434407;15051.172185529682;15068.773968390484;15076.547703568911;18402.171902264432;18913.527161820788;19791.208351665773;20286.797132028492;20550.58898822015;7271.963640181765;7429.145648250413;7595.3164215220895;7612.923870761221;7632.3512501438;1026.7997740440542;1037.201354956679;1086.2124959404528;1135.0295497349812;1152.6138743520846;31750.841245793625;32000.839995799874;32052.19869503281;32403.837980809945;33089.834550827094;1140.1391949078559;1162.5466068233395;1168.199783148546;1192.7077865922904;1216.8296438498617;16306.429274975319;17162.39931602413;17255.827441725673;17850;18048.729269060976;494951;499234;500641;501653;503094;60610.69694651499;61045.38954610486;61269.38730612726;61356;61656.69171654113;1430.779201356004;1460.4596299369302;1462.9487967921284;1470.1987416857837;1470.7573250413775;31406.842965785025;33878;33893.491597625565;34015.319693606485;34561.13597160091;53336;53937;54114.45885541094;54150.18774718461;54153;446718;451451;452838;452913;455490;29921.850390747906;30417.39165216639;30483.847580761954;30604.84697576498;30747.385052299276;46578;47441.28838067363;48768.512314876396;48783.26825097697;48987.75506122589;40662.79668601638;40929.38605920854;42214.1557168861;42781.78609106935;42949.78525107355;40663.39004914988;41573.792131039154;41645;41699.58300417078;41989.1602167961;42233.788831055645;42632;43731.78134109436;43883.122337552435;45899;35981;38046.61953380542;38219;38303.808480957414;38620.80689596534;29039.85480072586;29103;29221.123366299045;29230;29278.560821587267 16:12:33 INFO - PROCESS | 19641 | |2;jquery.html;422.1283050500718;431.0259211441056;435.9106383191446;439.2028468329981;439.2379222049741;18542.980136092527;18830.340938067187;20337.18651253948;20362.89818550909;20418.183272669095;19115.522111947208;19463.805361946375;19558.902205488954;19580.412587622395;20385.898070509666;5645.887082258363;5973.133895585138;5983.401659834025;5990.9400905990815;6001.729922153513;5618.101103823389;5775.249217601706;5845.152452894327;5865.648061116325;5951.821445356624;5791.942080579182;5835.970820145914;5839.094940284242;5839.79560715375;5840.824775256728;5658.999999999979;5785.884282314351;5808.854778630526;5842.47417732404;5856.092305692625;5289.312389389354;5293.708846013467;5294.311739473882;5296.788128474856;5297.920531192035;23570.410739731473;23635.172768953005;23770.04919803206;23814.285571432883;24328.635070473956;2440.2923152285816;2505.1236643651646;2572.1327391769623;2689.2201261634104;3091.7062879026457;14307.141571505743;15082.396704131821;15141.545753627408;15364.385424583003;15428.614284642861;1931.4821636582603;2001.6196922584663;2007.096806437109;2018.9697154542694;2027.3715148303925;80532.59733701353;81729.59135204286;82946.58526707329;83736.99999999939;84301;11778.411079445994;11892.286462812086;11961.820572691417;12085.45615447307;12087.697807554881;17444.91277543604;17451;17490.47528574145;17511.38710145139;17531.123443827757;8311.501309921425;8728.869066964;8842.823143537093;8869.73390798277;9007.05425930281;8584.270337021298;8683.869741953877;8688.6524539019;8713.607887645072;8909.287257019423;5149.845504634792;5159.7678104485385;5183.352080989876;5204.5576126028955;5285.524302812765;2106.1680636148635;2124.702541644171;2138.860974036683;2142.368001439579;2181.073043956312;973.8295798235281;997.6209040564684;1031.8297480915564;1035.0115639564199;1081.118888106191;18587.44237672872;19539.218431262874;19653.901730491256;20491.897540512204;20684;1015.1271900521654;1042.598599539183;1047.8944713327512;1056.2975621211808;1084.436093231515;10453.581856725797;11355.829662555068;11401.657950261506;11444.370559619301;11550.075993920635;463632;473008;481941;484524;493299;72574.63712681402;91404.54297728468;94939;94949;96131;999.5951639585979;1020.4693559349246;1074.3661239868516;1089.2484185911696;1098.340995402768;17447.47657570275;17697.20362583661;18043;18080.457586272434;18142.35164682671;42689;43044.78477607592;43162.352564712186;43436.78281608572;45230.32154517751;56744.432555675565;56927;57210.427895722176;64046.3595364059;64423;9102.13529714676;9145.954270228607;9261.351705380559;9311.627534898798;9350.485723285285;10131.696049118538;13167.341632918507;13451.192928424325;13900.443982240597;13992.720145596828;11528.59649912249;11643.12676549279;11680.415979200836;11970.880291196976;12096.213746106476;11275.605353812578;11517.712057198638;11709.297442153498;11968.581099661471;12177.33024683651;6419.935800641933;8059.234372734581;12194.207376520499;12621.116521843383;12939.223646581235;9049.457032578066;9096.49969251671;9169.633214671338;9288.674896378594;9570.47362395075;11372.658820235407;12449.564265250672;12537.93731031339;12612.306323151948;12653.304068276333 16:12:33 INFO - PROCESS | 19641 | |3;mootools.html;1471.3820195517885;1508.01978713836;1638.6640738648578;1754.7718796556446;1771.3268957796035;7987.121416644179;8217.055038670554;8483.618237179326;9081.727548173565;9095.363324567283;8481;8734.344924130684;8774.780630484242;8972.8654070189;8974.730758077252;2534.024400605766;2536.6195070739354;2562.7821635161035;2563.0260501009684;2575.2789219018705;2496.613024981131;2529.7217306096313;2553.48930213957;2556.1309154887335;2556.7059788124325;2478.3680161558777;2479.5412848622973;2499.462615537659;2512.258883629334;2522.407234299938;2437.305367970129;2468.123816045305;2471.4439251168433;2472.925812225636;2484.254723582936;2498.2255500794813;2512.773850353477;2515.76100270474;2530.519201351756;2547.3631592101974;8820.029796722356;8988.59551320192;8994;9018.098190180996;9048;5586.944130558683;5699.74351154199;5735.655860648333;5744.052231381817;5747.712614369307;3404.8638054478038;3601.135727425425;3627.147620309225;3641.435577485494;3664.3221004114057;1120.8879112088725;1187.4122309456789;1193.5703146867208;1203.6870413692416;1225.5955534673626;12496.625101246886;12561.56034538796;12590.81113783294;12606.243625382414;12619.810702839464;4943.9258411123865;4951.557594301707;5121.641485096007;5144.408393034774;5186.351706036746;10664.840027399596;10696.839547406795;10702.625408110678;10727.517261723242;10749.731256718645;5708.80019199326;5733.996550603628;5741.311042674905;5753.769849206069;5756.33802112754;5004.273525633651;5082.618803589746;5172.069027575073;5185.274061631375;5185.585153187736;4130.277201489727;4204.579542045833;4263.87208383749;4330.783460826946;4338.761368124783;1402.859714028589;1406.6975600245996;1420.6732451536204;1433.3048471491318;1435.6626192844674;967.4727273635885;1003.2926786615419;1016.2835201183149;1025.1849779425374;1033.5968972100886;6083.969580152159;6168.691565421711;6217.720202590895;6264.123022776815;6342.429181373698;509.79353361888496;512.7461906356377;525.1990714160859;529.6054439442563;538.464228093042;4273.850415235452;4385.3641222022625;4405.823767049282;4423.469183697976;4488.079943611552;10564.577416903237;11138.10895128404;11163.330200188015;11186.049185819134;11189.44052797357;10991.61529346469;11012.339259644446;11068.667939961813;11084.057855082247;11109.111271098292;8033.477823941425;8410.285125764256;8529.317654587618;8591.183837535424;8603.838481805002;6177.62934223948;6246.3305171609;6325;6390.680465976776;6459.580127291711;10226.53980570891;10249.590016399261;10291.433971131659;10331.793364132825;10356.637517686844;9582.520873956135;10030.297879148682;10094.697159085239;10300.124489418184;10557.577696892346;7872.881906771518;7908.5650289234645;8010.679572817022;8093.150219226896;8095.919040809516;8458.28104611115;8544.957275213832;8608.827823443622;8624.223819855992;8657.91342086571;7588.62056897164;7634.580098094658;7644.35023023027;7943.92056079455;7955.602219889098;7576.886346704694;7620.733274335594;7634.8091297718;7804.882926756217;7855.410844186595;6806.523543351917;7091.397231235196;7241.094863142107;7355.264473552602;7402.592857392679;5178.870528236825;5231.476852314738;5310.309659744363;5314.707691077027;5392.892142157057;5405.972970135124;5475.0418676730615;5531;5562.471565201299;5591.4688104629995 16:12:33 INFO - PROCESS | 19641 | |4;prototype.html;356.9089882080069;366.10122150121447;370.7015852238948;373.8635398079702;375.8552957111513;5692.345380281269;5727.770889164439;5739.225204597384;5741.540676745861;5768.134779783035;5334.786608535664;5621.7751289948355;5661.999140455555;5662.263905692254;5670.376258611549;4387.078713470175;4388.793081902487;4392.758398288093;4394.714343567658;4423.292273236283;4399.582039706239;4403.370752821461;4407.9779601101945;4424.97787511062;4430.5126436092005;4345.364050904538;4389.385486031958;4397.824087036514;4398.472183337988;4406.82372705093;4241.957580424187;4330.848420305306;4339.826406943718;4375.8249670013165;4387.407699960497;3848.9230215395814;3852.8266228019806;3872.651461368462;3875.5543112542136;3884.2814079395403;5491.489840293912;5495.642783219078;5501.367342755594;5505.6696598204235;5517.917231241535;4950.628702847265;5039.773210205512;5062.746862656889;5071.442141364447;5085.466026067284;5868.034208540144;5907.556933230025;5914.142449344821;5918.733656985446;5921;4281.207976524353;4286.87139385819;4289.420928174688;4297.78511074445;4312.245357062501;5768.702042040507;5862.677552734598;6032.487238584726;6053.606515576474;6142.385761423867;4307.784610769449;4332.028926838281;4339.913201735948;4370.2570563004365;4375.431193944831;4413.955860441419;4414.139242847614;4433.312836510346;4438.6005259526155;4454.5990860822685;4940.8764780880765;5023.171176755867;5044.369453818273;5063.8480845574695;5086.194400987596;5856.326522449887;5867.9413205867395;5874.765009399662;5877.235959325346;5910.940890591125;1462.751332273516;1472.5287907869379;1474.609228554434;1475.1886462445611;1475.7860110283948;977.2572844638127;1012.4532752313816;1021.6883850425692;1025.8307379282485;1032.6437379104198;5506.669599824023;5511.118221084607;5528.115501519737;5549.639273447213;5571.192177134374;5849.853753656193;5901.527877769854;5901.822945311647;5908.940910590925;5932.584719069624;5360.222767698662;5504.91742623861;5512.366077901012;5519.068326085838;5552.972235138798;3105.1926499110396;3111.3310638212893;3139.262273365757;3140.5553445414907;3157.4158780625658;5854.414558544111;6010.579259451796;6035.521297282194;6051.122587224916;6101.505131242785;5890.9410905891245;5919.526437884959;5924.496417804448;5945.940540594539;5967.283925928829;5788.565857560699;5933.554983376178;5961.701914904237;5963.2844058713235;6040.4563589276295;5730.942690573041;5755.223044888887;6055.636661800306;6168.444839964424;6172.753089876354;6007.88854062;6043.425874541911;6063.393660634078;6077.6353418795015;6093.48205402528;6115.510759139347;6231.501479881508;6254.499640028877;6305.905411418924;6305.905411418924;4479.529649386898;4486.7756612168605;4497.932531012103;4521.547845215452;4525.823285945744;5887.499562537232;6027.487663548647;6047.455728984412;6051.4553690168095;6087.391260873877;5927.8221653350465;5969.791057312973;5987.131865879336;5998.7300571473515;6012.609180403259;5884.823455296348;5942.30644266382;5952.934238867074;5998.580099393001;6011.248593925759;5767.884642307215;5796.82609521715;5861.648301101947;5912.615679980788;5938.346781853907;5993.130996005642;5997;6033.909491357721;6051.788187413596;6052.939470605237;5668.603197776116;5856.824295271149;5882.735276912464;5888.587798854039;5901.380355062828 16:12:33 INFO - PROCESS | 19641 | |5;yui.html;806.0448368683111;823.686998940403;848.8854004709365;852.4160949749419;892.7277180459961;13956.232407217625;14010.509632162877;14107.15357078576;14166.575002749922;15912.443064492745;14147.504837330696;14216.573502794932;14230.146191228534;14268.714625707506;14299.78550321746;849.4308813095241;853.6798700487317;855.5764896376271;863.9179277968583;864.7405778266526;846.6401779243828;865.6840253307529;866.2247288676631;870.7779516223354;871.020102384817;893.6202114101513;899.7705585075796;899.9235065019482;903;904.0417157812707;893.5175005497024;894.3471265975809;895.4492986813128;897.7261935109789;900.8198360327928;662.4104546953215;662.5825729790249;665.2449469851705;665.4576520136122;666.473485946102;13817.309134543233;13862.722745545032;13961;13973;14733.189674567895;13433;13945.372458239302;14205.857941420556;14211.78682319766;14590.562283131418;12255.816162757566;12325.69185770354;12457.75084498314;12510.81233781494;12575.685607859785;3709.9814500927323;3763.172102137553;3793.013816407726;3795.8291876865605;3849.615038496156;65441;66203;66705.66647166782;66795.33204667988;67469.66265168691;10946.781064378667;11026.614068507564;11145.609903653332;11228.55085796559;11434.771304573862;20649;20660.690089648666;20677.0695318711;20724.58550828975;20739.792602073787;8499.320054395634;8626.568671566396;8645.610947507377;8719.869201961976;8963.417377870417;4437.2234858899565;4499.190145773727;4618.468876079227;4830.275458681226;4940.456549779521;3544.5392099027476;3662.212624285791;3673.118451571657;3677.79772112531;3677.9448308275396;587.4272584230426;598.6946657204857;608.2123649873424;619.4486906653083;619.557016733038;713.12642013533;715.889037199235;766.1495739728897;789.960501974899;813.016250337087;9258.213051890665;10022.398656080513;10325.32885362449;10550.261481696361;10786.352818830896;674.2953613473932;689.9724011039602;745.5563939456015;776.5418403142173;804.5856383962264;4804.759762011886;5022.6233032522705;5059.924101138486;5145.562627176657;5196.76614552346;71248;90512;90917;91936.54031729799;93012.53493732623;46964.29553556699;59167.112493312634;64521.35478645247;64637.676811616584;69575.30424695688;50775.492245077075;63275.68362158252;64665.67667161634;64889.67555162288;67026.66486667536;10140.391576505433;10510.632127875488;10575.894241057491;10619.469026548797;10652.573897044342;46154.53845461637;46424.30363544482;46878;47674;47895.28157077577;57895.71052144712;63068.36931630625;63243.367566325585;63526;64387.356126438135;13019.609411717664;13821.516246931711;14114.082584631966;14171.574852754435;14378.496752613608;14720.411183552538;14925.17911514877;14953.551393458214;15102.773458398353;15963.840361596236;14288.57134285973;14293;14326.641833953818;14639.48761793332;14683.804422099576;13445.193288402726;13649.590512284647;13750.449982000608;13932.233727145105;14220.715585688435;12498.812517812423;12833.486660533474;13113.606591802261;13754.65613359674;14184.716305674036;11214.775704486028;11612.767744645229;11687.824682629598;11762.94118529402;11805.291682499077;11770.115861765426;11968.16222864391;12147.460328459762;12246.387680616112;12391.93804030974 16:12:33 INFO - PROCESS | 19641 | __end_tp_report 16:12:33 INFO - PROCESS | 19641 | __start_cc_report 16:12:33 INFO - PROCESS | 19641 | _x_x_mozilla_cycle_collect,317 16:12:33 INFO - PROCESS | 19641 | __end_cc_report 16:12:33 INFO - PROCESS | 19641 | __startTimestamp1481155953717__endTimestamp 16:12:33 INFO - PROCESS | 19641 | 16:12:33 INFO - PROCESS | 19641 | ------- Summary: start ------- 16:12:33 INFO - PROCESS | 19641 | Number of tests: 6 16:12:33 INFO - PROCESS | 19641 | 16:12:33 INFO - PROCESS | 19641 | [#0] dojo.html Cycles:165 Average:5805.00 Median:6051.43 stddev:660.85 (10.9%) stddev-sans-first:632.73 16:12:33 INFO - PROCESS | 19641 | Values: 3289.4 3319.6 3323.9 3331.0 3341.2 5792.6 5806.0 5850.1 5854.8 5880.4 5796.3 5835.7 5839.0 5864.1 5865.0 5277.1 5296.9 5329.6 5346.2 5356.9 5371.4 5376.1 5379.8 5395.0 5402.2 5159.9 5171.4 5329.1 5372.9 5387.7 5263.0 5286.1 5343.7 5389.3 5435.2 5274.7 5344.2 5369.1 5373.2 5380.5 5588.6 5800.9 5860.9 5873.2 5914.6 6109.4 6120.4 6158.8 6179.4 6207.8 6217.4 6229.9 6239.6 6322.6 6325.0 5907.0 5907.8 5907.9 5912.9 5938.3 6235.2 6261.9 6314.5 6381.1 6417.3 6155.4 6161.3 6166.4 6167.4 6168.5 5994.3 6070.5 6247.1 6264.1 6272.6 6135.7 6150.5 6154.4 6252.2 6260.8 6217.6 6229.0 6231.2 6251.0 6281.7 4668.7 4793.9 4848.8 4851.5 4856.4 4174.7 4193.1 4226.9 4228.0 4320.6 5945.5 5951.1 5974.1 5976.5 5980.8 6319.4 6320.7 6324.7 6336.0 6341.9 5750.2 5811.8 5913.2 5922.7 5966.8 5445.3 5446.0 5449.0 5452.2 5471.2 6371.8 6440.7 6499.6 6518.3 6545.3 6103.5 6125.8 6156.1 6205.3 6318.8 6485.6 6496.4 6497.2 6497.6 6502.5 6170.6 6193.8 6203.3 6207.8 6208.3 6013.5 6133.1 6140.8 6329.8 6330.2 5997.5 6120.7 6133.4 6152.4 6157.5 6105.7 6111.0 6114.6 6115.6 6122.6 5833.4 5888.9 6013.4 6086.4 6097.1 6122.3 6141.2 6154.0 6235.5 6241.2 6047.8 6051.4 6082.5 6085.6 6092.8 16:12:33 INFO - PROCESS | 19641 | 16:12:33 INFO - PROCESS | 19641 | [#1] ext.html Cycles:180 Average:63226.94 Median:43079.57 stddev:124606.20 (289.2%) stddev-sans-first:124866.98 16:12:33 INFO - PROCESS | 19641 | Values: 580.4 612.1 620.1 675.1 681.6 44398.6 45048.1 45507.3 49730.5 49815.3 45610.5 45680.1 46036.0 46253.0 46272.5 8739.3 8809.4 8818.6 8824.2 8863.7 8754.9 8773.6 8831.5 8840.4 8889.4 8811.7 8840.4 8900.8 8903.7 8921.3 8809.1 8834.2 8863.0 8872.6 8874.8 8595.4 8729.3 8734.1 8753.5 8772.0 42784.0 42827.8 42995.4 43163.8 43312.4 3704.9 3813.2 3824.0 4401.4 4490.6 32746.6 32768.8 32962.5 32977.8 34108.5 4237.6 4237.8 4244.0 4319.9 4324.1 366504.0 376609.0 376849.0 561456.0 561603.9 61471.1 61725.7 61736.7 61923.0 61925.0 39690.0 40495.8 66165.7 66638.0 66777.3 19038.4 19160.7 19303.4 19402.8 19522.4 14845.7 15029.3 15051.2 15068.8 15076.5 18402.2 18913.5 19791.2 20286.8 20550.6 7272.0 7429.1 7595.3 7612.9 7632.4 1026.8 1037.2 1086.2 1135.0 1152.6 31750.8 32000.8 32052.2 32403.8 33089.8 1140.1 1162.5 1168.2 1192.7 1216.8 16306.4 17162.4 17255.8 17850.0 18048.7 494951.0 499234.0 500641.0 501653.0 503094.0 60610.7 61045.4 61269.4 61356.0 61656.7 1430.8 1460.5 1462.9 1470.2 1470.8 31406.8 33878.0 33893.5 34015.3 34561.1 53336.0 53937.0 54114.5 54150.2 54153.0 446718.0 451451.0 452838.0 452913.0 455490.0 29921.9 30417.4 30483.8 30604.8 30747.4 46578.0 47441.3 48768.5 48783.3 48987.8 40662.8 40929.4 42214.2 42781.8 42949.8 40663.4 41573.8 41645.0 41699.6 41989.2 42233.8 42632.0 43731.8 43883.1 45899.0 35981.0 38046.6 38219.0 38303.8 38620.8 29039.9 29103.0 29221.1 29230.0 29278.6 16:12:33 INFO - PROCESS | 19641 | 16:12:33 INFO - PROCESS | 19641 | [#2] jquery.html Cycles:180 Average:29200.92 Median:2472.71 stddev:79052.12 (3197.0%) stddev-sans-first:79244.35 16:12:33 INFO - PROCESS | 19641 | Values: 422.1 431.0 435.9 439.2 439.2 18543.0 18830.3 20337.2 20362.9 20418.2 19115.5 19463.8 19558.9 19580.4 20385.9 5645.9 5973.1 5983.4 5990.9 6001.7 5618.1 5775.2 5845.2 5865.6 5951.8 5791.9 5836.0 5839.1 5839.8 5840.8 5659.0 5785.9 5808.9 5842.5 5856.1 5289.3 5293.7 5294.3 5296.8 5297.9 23570.4 23635.2 23770.0 23814.3 24328.6 2440.3 2505.1 2572.1 2689.2 3091.7 14307.1 15082.4 15141.5 15364.4 15428.6 1931.5 2001.6 2007.1 2019.0 2027.4 80532.6 81729.6 82946.6 83737.0 84301.0 11778.4 11892.3 11961.8 12085.5 12087.7 17444.9 17451.0 17490.5 17511.4 17531.1 8311.5 8728.9 8842.8 8869.7 9007.1 8584.3 8683.9 8688.7 8713.6 8909.3 5149.8 5159.8 5183.4 5204.6 5285.5 2106.2 2124.7 2138.9 2142.4 2181.1 973.8 997.6 1031.8 1035.0 1081.1 18587.4 19539.2 19653.9 20491.9 20684.0 1015.1 1042.6 1047.9 1056.3 1084.4 10453.6 11355.8 11401.7 11444.4 11550.1 463632.0 473008.0 481941.0 484524.0 493299.0 72574.6 91404.5 94939.0 94949.0 96131.0 999.6 1020.5 1074.4 1089.2 1098.3 17447.5 17697.2 18043.0 18080.5 18142.4 42689.0 43044.8 43162.4 43436.8 45230.3 56744.4 56927.0 57210.4 64046.4 64423.0 9102.1 9146.0 9261.4 9311.6 9350.5 10131.7 13167.3 13451.2 13900.4 13992.7 11528.6 11643.1 11680.4 11970.9 12096.2 11275.6 11517.7 11709.3 11968.6 12177.3 6419.9 8059.2 12194.2 12621.1 12939.2 9049.5 9096.5 9169.6 9288.7 9570.5 11372.7 12449.6 12537.9 12612.3 12653.3 16:12:33 INFO - PROCESS | 19641 | 16:12:33 INFO - PROCESS | 19641 | [#3] mootools.html Cycles:180 Average:5981.04 Median:5043.45 stddev:3311.19 (65.7%) stddev-sans-first:3303.13 16:12:33 INFO - PROCESS | 19641 | Values: 1471.4 1508.0 1638.7 1754.8 1771.3 7987.1 8217.1 8483.6 9081.7 9095.4 8481.0 8734.3 8774.8 8972.9 8974.7 2534.0 2536.6 2562.8 2563.0 2575.3 2496.6 2529.7 2553.5 2556.1 2556.7 2478.4 2479.5 2499.5 2512.3 2522.4 2437.3 2468.1 2471.4 2472.9 2484.3 2498.2 2512.8 2515.8 2530.5 2547.4 8820.0 8988.6 8994.0 9018.1 9048.0 5586.9 5699.7 5735.7 5744.1 5747.7 3404.9 3601.1 3627.1 3641.4 3664.3 1120.9 1187.4 1193.6 1203.7 1225.6 12496.6 12561.6 12590.8 12606.2 12619.8 4943.9 4951.6 5121.6 5144.4 5186.4 10664.8 10696.8 10702.6 10727.5 10749.7 5708.8 5734.0 5741.3 5753.8 5756.3 5004.3 5082.6 5172.1 5185.3 5185.6 4130.3 4204.6 4263.9 4330.8 4338.8 1402.9 1406.7 1420.7 1433.3 1435.7 967.5 1003.3 1016.3 1025.2 1033.6 6084.0 6168.7 6217.7 6264.1 6342.4 509.8 512.7 525.2 529.6 538.5 4273.9 4385.4 4405.8 4423.5 4488.1 10564.6 11138.1 11163.3 11186.0 11189.4 10991.6 11012.3 11068.7 11084.1 11109.1 8033.5 8410.3 8529.3 8591.2 8603.8 6177.6 6246.3 6325.0 6390.7 6459.6 10226.5 10249.6 10291.4 10331.8 10356.6 9582.5 10030.3 10094.7 10300.1 10557.6 7872.9 7908.6 8010.7 8093.2 8095.9 8458.3 8545.0 8608.8 8624.2 8657.9 7588.6 7634.6 7644.4 7943.9 7955.6 7576.9 7620.7 7634.8 7804.9 7855.4 6806.5 7091.4 7241.1 7355.3 7402.6 5178.9 5231.5 5310.3 5314.7 5392.9 5406.0 5475.0 5531.0 5562.5 5591.5 16:12:33 INFO - PROCESS | 19641 | 16:12:33 INFO - PROCESS | 19641 | [#4] prototype.html Cycles:180 Average:4954.66 Median:5641.89 stddev:1441.98 (25.6%) stddev-sans-first:1404.12 16:12:33 INFO - PROCESS | 19641 | Values: 356.9 366.1 370.7 373.9 375.9 5692.3 5727.8 5739.2 5741.5 5768.1 5334.8 5621.8 5662.0 5662.3 5670.4 4387.1 4388.8 4392.8 4394.7 4423.3 4399.6 4403.4 4408.0 4425.0 4430.5 4345.4 4389.4 4397.8 4398.5 4406.8 4242.0 4330.8 4339.8 4375.8 4387.4 3848.9 3852.8 3872.7 3875.6 3884.3 5491.5 5495.6 5501.4 5505.7 5517.9 4950.6 5039.8 5062.7 5071.4 5085.5 5868.0 5907.6 5914.1 5918.7 5921.0 4281.2 4286.9 4289.4 4297.8 4312.2 5768.7 5862.7 6032.5 6053.6 6142.4 4307.8 4332.0 4339.9 4370.3 4375.4 4414.0 4414.1 4433.3 4438.6 4454.6 4940.9 5023.2 5044.4 5063.8 5086.2 5856.3 5867.9 5874.8 5877.2 5910.9 1462.8 1472.5 1474.6 1475.2 1475.8 977.3 1012.5 1021.7 1025.8 1032.6 5506.7 5511.1 5528.1 5549.6 5571.2 5849.9 5901.5 5901.8 5908.9 5932.6 5360.2 5504.9 5512.4 5519.1 5553.0 3105.2 3111.3 3139.3 3140.6 3157.4 5854.4 6010.6 6035.5 6051.1 6101.5 5890.9 5919.5 5924.5 5945.9 5967.3 5788.6 5933.6 5961.7 5963.3 6040.5 5730.9 5755.2 6055.6 6168.4 6172.8 6007.9 6043.4 6063.4 6077.6 6093.5 6115.5 6231.5 6254.5 6305.9 6305.9 4479.5 4486.8 4497.9 4521.5 4525.8 5887.5 6027.5 6047.5 6051.5 6087.4 5927.8 5969.8 5987.1 5998.7 6012.6 5884.8 5942.3 5952.9 5998.6 6011.2 5767.9 5796.8 5861.6 5912.6 5938.3 5993.1 5997.0 6033.9 6051.8 6052.9 5668.6 5856.8 5882.7 5888.6 5901.4 16:12:33 INFO - PROCESS | 19641 | 16:12:33 INFO - PROCESS | 19641 | [#5] yui.html Cycles:180 Average:17655.26 Median:25326.86 stddev:22348.42 (88.2%) stddev-sans-first:22375.30 16:12:33 INFO - PROCESS | 19641 | Values: 806.0 823.7 848.9 852.4 892.7 13956.2 14010.5 14107.2 14166.6 15912.4 14147.5 14216.6 14230.1 14268.7 14299.8 849.4 853.7 855.6 863.9 864.7 846.6 865.7 866.2 870.8 871.0 893.6 899.8 899.9 903.0 904.0 893.5 894.3 895.4 897.7 900.8 662.4 662.6 665.2 665.5 666.5 13817.3 13862.7 13961.0 13973.0 14733.2 13433.0 13945.4 14205.9 14211.8 14590.6 12255.8 12325.7 12457.8 12510.8 12575.7 3710.0 3763.2 3793.0 3795.8 3849.6 65441.0 66203.0 66705.7 66795.3 67469.7 10946.8 11026.6 11145.6 11228.6 11434.8 20649.0 20660.7 20677.1 20724.6 20739.8 8499.3 8626.6 8645.6 8719.9 8963.4 4437.2 4499.2 4618.5 4830.3 4940.5 3544.5 3662.2 3673.1 3677.8 3677.9 587.4 598.7 608.2 619.4 619.6 713.1 715.9 766.1 790.0 813.0 9258.2 10022.4 10325.3 10550.3 10786.4 674.3 690.0 745.6 776.5 804.6 4804.8 5022.6 5059.9 5145.6 5196.8 71248.0 90512.0 90917.0 91936.5 93012.5 46964.3 59167.1 64521.4 64637.7 69575.3 50775.5 63275.7 64665.7 64889.7 67026.7 10140.4 10510.6 10575.9 10619.5 10652.6 46154.5 46424.3 46878.0 47674.0 47895.3 57895.7 63068.4 63243.4 63526.0 64387.4 13019.6 13821.5 14114.1 14171.6 14378.5 14720.4 14925.2 14953.6 15102.8 15963.8 14288.6 14293.0 14326.6 14639.5 14683.8 13445.2 13649.6 13750.4 13932.2 14220.7 12498.8 12833.5 13113.6 13754.7 14184.7 11214.8 11612.8 11687.8 11762.9 11805.3 11770.1 11968.2 12147.5 12246.4 12391.9 16:12:33 INFO - PROCESS | 19641 | -------- Summary: end -------- 16:12:33 INFO - PROCESS | 19641 | 16:12:34 INFO - TEST-INFO | 19641: exit 0 16:12:34 INFO - TEST-OK | dromaeo_css | took 1113572ms 16:12:34 INFO - TEST-START | kraken 16:12:34 INFO - operating with platform_type : linux_ 16:12:34 INFO - Initialising browser for kraken test... 16:12:34 INFO - TEST-INFO | started process 20011 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1xSGxL/profile http://localhost:58730/getInfo.html) 16:12:39 INFO - PROCESS | 20011 | __metrics Screen width/height:1600/1200 16:12:39 INFO - PROCESS | 20011 | colorDepth:24 16:12:39 INFO - PROCESS | 20011 | Browser inner width/height: 1024/697 16:12:39 INFO - PROCESS | 20011 | __metrics 16:12:39 ERROR - PROCESS | 20011 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3175: TypeError: this.tabs is undefined 16:12:40 INFO - TEST-INFO | 20011: exit 0 16:12:40 INFO - Browser initialized. 16:12:40 INFO - Running cycle 1/1 for kraken test... 16:12:40 INFO - TEST-INFO | started process 20146 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp1xSGxL/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:12:52 INFO - PROCESS | 20146 | RSS: Main: 151621632 16:12:52 INFO - PROCESS | 20146 | 16:12:54 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58730/tests/kraken/driver.html?testName=audio-beat-detection) 16:12:55 INFO - PROCESS | 20146 | RSS: Main: 156966912 16:12:55 INFO - PROCESS | 20146 | 16:12:58 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58730/tests/kraken/driver.html?testName=audio-dft) 16:12:59 INFO - PROCESS | 20146 | RSS: Main: 155082752 16:12:59 INFO - PROCESS | 20146 | 16:13:01 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58730/tests/kraken/driver.html?testName=audio-fft) 16:13:02 INFO - PROCESS | 20146 | RSS: Main: 155332608 16:13:02 INFO - PROCESS | 20146 | 16:13:04 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58730/tests/kraken/driver.html?testName=audio-oscillator) 16:13:05 INFO - PROCESS | 20146 | RSS: Main: 155029504 16:13:05 INFO - PROCESS | 20146 | 16:13:07 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58730/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:13:07 INFO - PROCESS | 20146 | RSS: Main: 155529216 16:13:07 INFO - PROCESS | 20146 | 16:13:10 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58730/tests/kraken/driver.html?testName=imaging-darkroom) 16:13:11 INFO - PROCESS | 20146 | RSS: Main: 158633984 16:13:11 INFO - PROCESS | 20146 | 16:13:14 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58730/tests/kraken/driver.html?testName=imaging-desaturate) 16:13:15 INFO - PROCESS | 20146 | RSS: Main: 158339072 16:13:15 INFO - PROCESS | 20146 | 16:13:18 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58730/tests/kraken/driver.html?testName=json-parse-financial) 16:13:18 INFO - PROCESS | 20146 | RSS: Main: 158019584 16:13:18 INFO - PROCESS | 20146 | 16:13:20 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58730/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:13:20 INFO - PROCESS | 20146 | RSS: Main: 157454336 16:13:20 INFO - PROCESS | 20146 | 16:13:22 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58730/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:13:23 INFO - PROCESS | 20146 | RSS: Main: 157396992 16:13:23 INFO - PROCESS | 20146 | 16:13:25 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58730/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:13:26 INFO - PROCESS | 20146 | RSS: Main: 157679616 16:13:26 INFO - PROCESS | 20146 | 16:13:28 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58730/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:13:29 INFO - PROCESS | 20146 | RSS: Main: 157618176 16:13:29 INFO - PROCESS | 20146 | 16:13:32 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58730/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:13:32 INFO - PROCESS | 20146 | RSS: Main: 158097408 16:13:32 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | Cycle 1(1): loaded http://localhost:58730/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58730/tests/kraken/driver.html?testName=ai-astar) 16:13:34 INFO - PROCESS | 20146 | RSS: Main: 159911936 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | __start_tp_report 16:13:34 INFO - PROCESS | 20146 | _x_x_mozilla_page_load 16:13:34 INFO - PROCESS | 20146 | _x_x_mozilla_page_load_details 16:13:34 INFO - PROCESS | 20146 | |i|pagename|runs| 16:13:34 INFO - PROCESS | 20146 | |0;ai-astar;102;112;113;112;112;113;112;112;112;112 16:13:34 INFO - PROCESS | 20146 | |1;audio-beat-detection;148;123;126;165;134;128;123;125;146;122 16:13:34 INFO - PROCESS | 20146 | |2;audio-dft;163;163;164;162;163;162;162;161;163;164 16:13:34 INFO - PROCESS | 20146 | |3;audio-fft;74;75;77;105;77;77;76;75;101;76 16:13:34 INFO - PROCESS | 20146 | |4;audio-oscillator;82;81;120;82;84;82;97;81;84;119 16:13:34 INFO - PROCESS | 20146 | |5;imaging-gaussian-blur;119;118;117;119;119;118;118;117;119;118 16:13:34 INFO - PROCESS | 20146 | |6;imaging-darkroom;149;148;146;146;148;148;147;148;148;147 16:13:34 INFO - PROCESS | 20146 | |7;imaging-desaturate;85;85;85;85;87;85;85;85;86;86 16:13:34 INFO - PROCESS | 20146 | |8;json-parse-financial;59;52;55;52;53;52;51;52;51;52 16:13:34 INFO - PROCESS | 20146 | |9;json-stringify-tinderbox;57;58;58;58;58;57;58;58;58;58 16:13:34 INFO - PROCESS | 20146 | |10;stanford-crypto-aes;75;76;81;76;80;76;76;77;82;82 16:13:34 INFO - PROCESS | 20146 | |11;stanford-crypto-ccm;129;136;134;144;132;127;130;129;166;143 16:13:34 INFO - PROCESS | 20146 | |12;stanford-crypto-pbkdf2;157;158;153;153;157;154;154;161;156;153 16:13:34 INFO - PROCESS | 20146 | |13;stanford-crypto-sha256-iterative;65;64;63;64;64;68;67;63;62;63 16:13:34 INFO - PROCESS | 20146 | __end_tp_report 16:13:34 INFO - PROCESS | 20146 | __start_cc_report 16:13:34 INFO - PROCESS | 20146 | _x_x_mozilla_cycle_collect,833 16:13:34 INFO - PROCESS | 20146 | __end_cc_report 16:13:34 INFO - PROCESS | 20146 | __startTimestamp1481156014591__endTimestamp 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | ------- Summary: start ------- 16:13:34 INFO - PROCESS | 20146 | Number of tests: 14 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#0] ai-astar Cycles:10 Average:111.20 Median:112.00 stddev:3.26 (2.9%) stddev-sans-first:0.44 16:13:34 INFO - PROCESS | 20146 | Values: 102.0 112.0 113.0 112.0 112.0 113.0 112.0 112.0 112.0 112.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#1] audio-beat-detection Cycles:10 Average:134.00 Median:131.00 stddev:14.41 (11.0%) stddev-sans-first:14.36 16:13:34 INFO - PROCESS | 20146 | Values: 148.0 123.0 126.0 165.0 134.0 128.0 123.0 125.0 146.0 122.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#2] audio-dft Cycles:10 Average:162.70 Median:163.00 stddev:0.95 (0.6%) stddev-sans-first:1.00 16:13:34 INFO - PROCESS | 20146 | Values: 163.0 163.0 164.0 162.0 163.0 162.0 162.0 161.0 163.0 164.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#3] audio-fft Cycles:10 Average:81.30 Median:76.00 stddev:11.52 (15.2%) stddev-sans-first:11.91 16:13:34 INFO - PROCESS | 20146 | Values: 74.0 75.0 77.0 105.0 77.0 77.0 76.0 75.0 101.0 76.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#4] audio-oscillator Cycles:10 Average:91.20 Median:82.00 stddev:15.64 (19.1%) stddev-sans-first:16.23 16:13:34 INFO - PROCESS | 20146 | Values: 82.0 81.0 120.0 82.0 84.0 82.0 97.0 81.0 84.0 119.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#5] imaging-gaussian-blur Cycles:10 Average:118.20 Median:118.50 stddev:0.79 (0.7%) stddev-sans-first:0.78 16:13:34 INFO - PROCESS | 20146 | Values: 119.0 118.0 117.0 119.0 119.0 118.0 118.0 117.0 119.0 118.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#6] imaging-darkroom Cycles:10 Average:147.50 Median:148.00 stddev:0.97 (0.7%) stddev-sans-first:0.87 16:13:34 INFO - PROCESS | 20146 | Values: 149.0 148.0 146.0 146.0 148.0 148.0 147.0 148.0 148.0 147.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#7] imaging-desaturate Cycles:10 Average:85.40 Median:85.00 stddev:0.70 (0.8%) stddev-sans-first:0.73 16:13:34 INFO - PROCESS | 20146 | Values: 85.0 85.0 85.0 85.0 87.0 85.0 85.0 85.0 86.0 86.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#8] json-parse-financial Cycles:10 Average:52.90 Median:52.00 stddev:2.42 (4.7%) stddev-sans-first:1.20 16:13:34 INFO - PROCESS | 20146 | Values: 59.0 52.0 55.0 52.0 53.0 52.0 51.0 52.0 51.0 52.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#9] json-stringify-tinderbox Cycles:10 Average:57.80 Median:58.00 stddev:0.42 (0.7%) stddev-sans-first:0.33 16:13:34 INFO - PROCESS | 20146 | Values: 57.0 58.0 58.0 58.0 58.0 57.0 58.0 58.0 58.0 58.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#10] stanford-crypto-aes Cycles:10 Average:78.10 Median:78.50 stddev:2.81 (3.6%) stddev-sans-first:2.74 16:13:34 INFO - PROCESS | 20146 | Values: 75.0 76.0 81.0 76.0 80.0 76.0 76.0 77.0 82.0 82.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#11] stanford-crypto-ccm Cycles:10 Average:137.00 Median:135.00 stddev:11.73 (8.7%) stddev-sans-first:12.08 16:13:34 INFO - PROCESS | 20146 | Values: 129.0 136.0 134.0 144.0 132.0 127.0 130.0 129.0 166.0 143.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:155.60 Median:156.50 stddev:2.67 (1.7%) stddev-sans-first:2.79 16:13:34 INFO - PROCESS | 20146 | Values: 157.0 158.0 153.0 153.0 157.0 154.0 154.0 161.0 156.0 153.0 16:13:34 INFO - PROCESS | 20146 | 16:13:34 INFO - PROCESS | 20146 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.30 Median:64.00 stddev:1.89 (3.0%) stddev-sans-first:1.99 16:13:34 INFO - PROCESS | 20146 | Values: 65.0 64.0 63.0 64.0 64.0 68.0 67.0 63.0 62.0 63.0 16:13:34 INFO - PROCESS | 20146 | -------- Summary: end -------- 16:13:34 INFO - PROCESS | 20146 | 16:13:35 INFO - TEST-INFO | 20146: exit 0 16:13:35 INFO - TEST-OK | kraken | took 61095ms 16:13:35 INFO - SUITE-END | took 1174s 16:13:35 INFO - Completed test suite (00:19:34) 16:13:35 INFO - javascript benchmark 16:13:35 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7553.0937955501095, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3289.42435073862, 3319.6348401675828, 3323.9002829915103, 3331.0173498817862, 3341.198112453012, 5792.594518383709, 5805.970970145143, 5850.063989761639, 5854.7658093676255, 5880.353161152275, 5796.30444346679, 5835.708214589275, 5838.970805145968, 5864.149698293745, 5865.032269675509, 5277.12927366984, 5296.867578310535, 5329.600279978998, 5346.198070289449, 5356.91964620531, 5371.355437347524, 5376.086065368897, 5379.784808607651, 5395.028894798935, 5402.162664786944, 5159.948400515985, 5171.3535808024, 5329.067413202693, 5372.865678358034, 5387.730613469331, 5262.973685131569, 5286.127788914843, 5343.706096164709, 5389.326334208224, 5435.157550579666, 5274.657147285414, 5344.198370244456, 5369.114096174127, 5373.194020896858, 5380.488853558905, 5588.552915766729, 5800.941990580124, 5860.912086318709, 5873.207117039187, 5914.556408269354, 6109.3890610939, 6120.355709576858, 6158.784442544535, 6179.351168127372, 6207.844803879894, 6217.378262173792, 6229.87540249197, 6239.563230573862, 6322.58903171297, 6324.968375158141, 5907.0, 5907.793227237069, 5907.852303692356, 5912.881742365129, 5938.317093534256, 6235.158253635792, 6261.874762504815, 6314.494840412756, 6381.1385462962835, 6417.262014868256, 6155.446009859134, 6161.322254551996, 6166.414190651881, 6167.352427995085, 6168.506519478431, 5994.250718660168, 6070.514358851281, 6247.094171345129, 6264.123022776815, 6272.6236425814595, 6135.723892424851, 6150.50795936324, 6154.446099851035, 6252.218472690914, 6260.812175634738, 6217.564770466114, 6229.034499652561, 6231.189945307172, 6250.968745156245, 6281.748730050838, 4668.696534725232, 4793.856184314476, 4848.8302909398, 4851.466338702739, 4856.39295088114, 4174.666026717855, 4193.1404062167185, 4226.915461690749, 4227.957720422818, 4320.589543993316, 5945.494632956247, 5951.077582974646, 5974.103884417372, 5976.491998180117, 5980.760769569256, 6319.368063193644, 6320.652364120017, 6324.71538780756, 6336.0, 6341.936580634227, 5750.1949727038245, 5811.767529298865, 5913.172155898178, 5922.733476993546, 5966.791162309385, 5445.264889239981, 5446.019716451076, 5449.01917654818, 5452.182172674051, 5471.206675032098, 6371.776987805404, 6440.677966101676, 6499.642519661464, 6518.28298887122, 6545.345465453416, 6103.542234332532, 6125.784909797739, 6156.138140660221, 6205.286392064971, 6318.778842740482, 6485.643289618927, 6496.382843629847, 6497.155369802084, 6497.642629655415, 6502.479801615954, 6170.56806023592, 6193.84515387119, 6203.286622038523, 6207.782727604693, 6208.25500939872, 6013.548983826318, 6133.141360209485, 6140.84169297792, 6329.841753956188, 6330.240371155307, 5997.520198384206, 6120.718041849287, 6133.355997620364, 6152.354002829818, 6157.507399407947, 6105.693442272482, 6110.984061328523, 6114.571104522668, 6115.635867915642, 6122.611623597813, 5833.358330583717, 5888.852778680567, 6013.428724271187, 6086.391360863879, 6097.054956481752, 6122.326544080237, 6141.179174348115, 6154.046122850965, 6235.501159907106, 6241.188645476059, 6047.758089676539, 6051.425114614105, 6082.513398927987, 6085.57400981927, 6092.75628974836], "value": 5759.684337245617, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [580.3702982264243, 612.0727098445856, 620.1256228717508, 675.1122274209414, 681.6285124607089, 44398.55601443985, 45048.09903801922, 45507.31739023917, 49730.50269497304, 49815.25277120846, 45610.543894561044, 45680.0863982721, 46036.0, 46253.0, 46272.53727462724, 8739.257163141141, 8809.38334316598, 8818.64725410986, 8824.161704638049, 8863.689770858022, 8754.912450875474, 8773.64905403783, 8831.47011179328, 8840.38117331787, 8889.377743557954, 8811.735647930573, 8840.425372350808, 8900.821983560325, 8903.688370907019, 8921.33090018248, 8809.075047120055, 8834.249088827457, 8862.955685221597, 8872.556372181365, 8874.822503549893, 8595.3553483489, 8729.258013068897, 8734.12658734128, 8753.518556479392, 8771.956140219258, 42784.0, 42827.785861070806, 42995.35506967398, 43163.784181078896, 43312.35031474499, 3704.8888533344043, 3813.237352529505, 3823.9808800956093, 4401.427814384142, 4490.640748740093, 32746.62096521083, 32768.83615581931, 32962.50556241658, 32977.83511082453, 34108.48837267443, 4237.555056719031, 4237.788110594489, 4244.0, 4319.892002699926, 4324.070324880166, 366504.0, 376609.0, 376849.0, 561456.0, 561603.9112959666, 61471.07793383103, 61725.69137154285, 61736.69131654313, 61923.0, 61925.0, 39690.0, 40495.79752101221, 66165.66917165383, 66638.0, 66777.33222667809, 19038.428847134608, 19160.71258931117, 19303.4208973731, 19402.8059719401, 19522.414327570197, 14845.703085938221, 15029.323680434407, 15051.172185529682, 15068.773968390484, 15076.547703568911, 18402.171902264432, 18913.527161820788, 19791.208351665773, 20286.797132028492, 20550.58898822015, 7271.963640181765, 7429.145648250413, 7595.3164215220895, 7612.923870761221, 7632.3512501438, 1026.7997740440542, 1037.201354956679, 1086.2124959404528, 1135.0295497349812, 1152.6138743520846, 31750.841245793625, 32000.839995799874, 32052.19869503281, 32403.837980809945, 33089.834550827094, 1140.1391949078559, 1162.5466068233395, 1168.199783148546, 1192.7077865922904, 1216.8296438498617, 16306.429274975319, 17162.39931602413, 17255.827441725673, 17850.0, 18048.729269060976, 494951.0, 499234.0, 500641.0, 501653.0, 503094.0, 60610.69694651499, 61045.38954610486, 61269.38730612726, 61356.0, 61656.69171654113, 1430.779201356004, 1460.4596299369302, 1462.9487967921284, 1470.1987416857837, 1470.7573250413775, 31406.842965785025, 33878.0, 33893.491597625565, 34015.319693606485, 34561.13597160091, 53336.0, 53937.0, 54114.45885541094, 54150.18774718461, 54153.0, 446718.0, 451451.0, 452838.0, 452913.0, 455490.0, 29921.850390747906, 30417.39165216639, 30483.847580761954, 30604.84697576498, 30747.385052299276, 46578.0, 47441.28838067363, 48768.512314876396, 48783.26825097697, 48987.75506122589, 40662.79668601638, 40929.38605920854, 42214.1557168861, 42781.78609106935, 42949.78525107355, 40663.39004914988, 41573.792131039154, 41645.0, 41699.58300417078, 41989.1602167961, 42233.788831055645, 42632.0, 43731.78134109436, 43883.122337552435, 45899.0, 35981.0, 38046.61953380542, 38219.0, 38303.808480957414, 38620.80689596534, 29039.85480072586, 29103.0, 29221.123366299045, 29230.0, 29278.560821587267], "value": 20973.559556935375, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [422.1283050500718, 431.0259211441056, 435.9106383191446, 439.2028468329981, 439.2379222049741, 18542.980136092527, 18830.340938067187, 20337.18651253948, 20362.89818550909, 20418.183272669095, 19115.522111947208, 19463.805361946375, 19558.902205488954, 19580.412587622395, 20385.898070509666, 5645.887082258363, 5973.133895585138, 5983.401659834025, 5990.9400905990815, 6001.729922153513, 5618.101103823389, 5775.249217601706, 5845.152452894327, 5865.648061116325, 5951.821445356624, 5791.942080579182, 5835.970820145914, 5839.094940284242, 5839.79560715375, 5840.824775256728, 5658.999999999979, 5785.884282314351, 5808.854778630526, 5842.47417732404, 5856.092305692625, 5289.312389389354, 5293.708846013467, 5294.311739473882, 5296.788128474856, 5297.920531192035, 23570.410739731473, 23635.172768953005, 23770.04919803206, 23814.285571432883, 24328.635070473956, 2440.2923152285816, 2505.1236643651646, 2572.1327391769623, 2689.2201261634104, 3091.7062879026457, 14307.141571505743, 15082.396704131821, 15141.545753627408, 15364.385424583003, 15428.614284642861, 1931.4821636582603, 2001.6196922584663, 2007.096806437109, 2018.9697154542694, 2027.3715148303925, 80532.59733701353, 81729.59135204286, 82946.58526707329, 83736.99999999939, 84301.0, 11778.411079445994, 11892.286462812086, 11961.820572691417, 12085.45615447307, 12087.697807554881, 17444.91277543604, 17451.0, 17490.47528574145, 17511.38710145139, 17531.123443827757, 8311.501309921425, 8728.869066964, 8842.823143537093, 8869.73390798277, 9007.05425930281, 8584.270337021298, 8683.869741953877, 8688.6524539019, 8713.607887645072, 8909.287257019423, 5149.845504634792, 5159.7678104485385, 5183.352080989876, 5204.5576126028955, 5285.524302812765, 2106.1680636148635, 2124.702541644171, 2138.860974036683, 2142.368001439579, 2181.073043956312, 973.8295798235281, 997.6209040564684, 1031.8297480915564, 1035.0115639564199, 1081.118888106191, 18587.44237672872, 19539.218431262874, 19653.901730491256, 20491.897540512204, 20684.0, 1015.1271900521654, 1042.598599539183, 1047.8944713327512, 1056.2975621211808, 1084.436093231515, 10453.581856725797, 11355.829662555068, 11401.657950261506, 11444.370559619301, 11550.075993920635, 463632.0, 473008.0, 481941.0, 484524.0, 493299.0, 72574.63712681402, 91404.54297728468, 94939.0, 94949.0, 96131.0, 999.5951639585979, 1020.4693559349246, 1074.3661239868516, 1089.2484185911696, 1098.340995402768, 17447.47657570275, 17697.20362583661, 18043.0, 18080.457586272434, 18142.35164682671, 42689.0, 43044.78477607592, 43162.352564712186, 43436.78281608572, 45230.32154517751, 56744.432555675565, 56927.0, 57210.427895722176, 64046.3595364059, 64423.0, 9102.13529714676, 9145.954270228607, 9261.351705380559, 9311.627534898798, 9350.485723285285, 10131.696049118538, 13167.341632918507, 13451.192928424325, 13900.443982240597, 13992.720145596828, 11528.59649912249, 11643.12676549279, 11680.415979200836, 11970.880291196976, 12096.213746106476, 11275.605353812578, 11517.712057198638, 11709.297442153498, 11968.581099661471, 12177.33024683651, 6419.935800641933, 8059.234372734581, 12194.207376520499, 12621.116521843383, 12939.223646581235, 9049.457032578066, 9096.49969251671, 9169.633214671338, 9288.674896378594, 9570.47362395075, 11372.658820235407, 12449.564265250672, 12537.93731031339, 12612.306323151948, 12653.304068276333], "value": 9660.156728095204, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1471.3820195517885, 1508.01978713836, 1638.6640738648578, 1754.7718796556446, 1771.3268957796035, 7987.121416644179, 8217.055038670554, 8483.618237179326, 9081.727548173565, 9095.363324567283, 8481.0, 8734.344924130684, 8774.780630484242, 8972.8654070189, 8974.730758077252, 2534.024400605766, 2536.6195070739354, 2562.7821635161035, 2563.0260501009684, 2575.2789219018705, 2496.613024981131, 2529.7217306096313, 2553.48930213957, 2556.1309154887335, 2556.7059788124325, 2478.3680161558777, 2479.5412848622973, 2499.462615537659, 2512.258883629334, 2522.407234299938, 2437.305367970129, 2468.123816045305, 2471.4439251168433, 2472.925812225636, 2484.254723582936, 2498.2255500794813, 2512.773850353477, 2515.76100270474, 2530.519201351756, 2547.3631592101974, 8820.029796722356, 8988.59551320192, 8994.0, 9018.098190180996, 9048.0, 5586.944130558683, 5699.74351154199, 5735.655860648333, 5744.052231381817, 5747.712614369307, 3404.8638054478038, 3601.135727425425, 3627.147620309225, 3641.435577485494, 3664.3221004114057, 1120.8879112088725, 1187.4122309456789, 1193.5703146867208, 1203.6870413692416, 1225.5955534673626, 12496.625101246886, 12561.56034538796, 12590.81113783294, 12606.243625382414, 12619.810702839464, 4943.9258411123865, 4951.557594301707, 5121.641485096007, 5144.408393034774, 5186.351706036746, 10664.840027399596, 10696.839547406795, 10702.625408110678, 10727.517261723242, 10749.731256718645, 5708.80019199326, 5733.996550603628, 5741.311042674905, 5753.769849206069, 5756.33802112754, 5004.273525633651, 5082.618803589746, 5172.069027575073, 5185.274061631375, 5185.585153187736, 4130.277201489727, 4204.579542045833, 4263.87208383749, 4330.783460826946, 4338.761368124783, 1402.859714028589, 1406.6975600245996, 1420.6732451536204, 1433.3048471491318, 1435.6626192844674, 967.4727273635885, 1003.2926786615419, 1016.2835201183149, 1025.1849779425374, 1033.5968972100886, 6083.969580152159, 6168.691565421711, 6217.720202590895, 6264.123022776815, 6342.429181373698, 509.79353361888496, 512.7461906356377, 525.1990714160859, 529.6054439442563, 538.464228093042, 4273.850415235452, 4385.3641222022625, 4405.823767049282, 4423.469183697976, 4488.079943611552, 10564.577416903237, 11138.10895128404, 11163.330200188015, 11186.049185819134, 11189.44052797357, 10991.61529346469, 11012.339259644446, 11068.667939961813, 11084.057855082247, 11109.111271098292, 8033.477823941425, 8410.285125764256, 8529.317654587618, 8591.183837535424, 8603.838481805002, 6177.62934223948, 6246.3305171609, 6325.0, 6390.680465976776, 6459.580127291711, 10226.53980570891, 10249.590016399261, 10291.433971131659, 10331.793364132825, 10356.637517686844, 9582.520873956135, 10030.297879148682, 10094.697159085239, 10300.124489418184, 10557.577696892346, 7872.881906771518, 7908.5650289234645, 8010.679572817022, 8093.150219226896, 8095.919040809516, 8458.28104611115, 8544.957275213832, 8608.827823443622, 8624.223819855992, 8657.91342086571, 7588.62056897164, 7634.580098094658, 7644.35023023027, 7943.92056079455, 7955.602219889098, 7576.886346704694, 7620.733274335594, 7634.8091297718, 7804.882926756217, 7855.410844186595, 6806.523543351917, 7091.397231235196, 7241.094863142107, 7355.264473552602, 7402.592857392679, 5178.870528236825, 5231.476852314738, 5310.309659744363, 5314.707691077027, 5392.892142157057, 5405.972970135124, 5475.0418676730615, 5531.0, 5562.471565201299, 5591.4688104629995], "value": 4773.496028603766, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [356.9089882080069, 366.10122150121447, 370.7015852238948, 373.8635398079702, 375.8552957111513, 5692.345380281269, 5727.770889164439, 5739.225204597384, 5741.540676745861, 5768.134779783035, 5334.786608535664, 5621.7751289948355, 5661.999140455555, 5662.263905692254, 5670.376258611549, 4387.078713470175, 4388.793081902487, 4392.758398288093, 4394.714343567658, 4423.292273236283, 4399.582039706239, 4403.370752821461, 4407.9779601101945, 4424.97787511062, 4430.5126436092005, 4345.364050904538, 4389.385486031958, 4397.824087036514, 4398.472183337988, 4406.82372705093, 4241.957580424187, 4330.848420305306, 4339.826406943718, 4375.8249670013165, 4387.407699960497, 3848.9230215395814, 3852.8266228019806, 3872.651461368462, 3875.5543112542136, 3884.2814079395403, 5491.489840293912, 5495.642783219078, 5501.367342755594, 5505.6696598204235, 5517.917231241535, 4950.628702847265, 5039.773210205512, 5062.746862656889, 5071.442141364447, 5085.466026067284, 5868.034208540144, 5907.556933230025, 5914.142449344821, 5918.733656985446, 5921.0, 4281.207976524353, 4286.87139385819, 4289.420928174688, 4297.78511074445, 4312.245357062501, 5768.702042040507, 5862.677552734598, 6032.487238584726, 6053.606515576474, 6142.385761423867, 4307.784610769449, 4332.028926838281, 4339.913201735948, 4370.2570563004365, 4375.431193944831, 4413.955860441419, 4414.139242847614, 4433.312836510346, 4438.6005259526155, 4454.5990860822685, 4940.8764780880765, 5023.171176755867, 5044.369453818273, 5063.8480845574695, 5086.194400987596, 5856.326522449887, 5867.9413205867395, 5874.765009399662, 5877.235959325346, 5910.940890591125, 1462.751332273516, 1472.5287907869379, 1474.609228554434, 1475.1886462445611, 1475.7860110283948, 977.2572844638127, 1012.4532752313816, 1021.6883850425692, 1025.8307379282485, 1032.6437379104198, 5506.669599824023, 5511.118221084607, 5528.115501519737, 5549.639273447213, 5571.192177134374, 5849.853753656193, 5901.527877769854, 5901.822945311647, 5908.940910590925, 5932.584719069624, 5360.222767698662, 5504.91742623861, 5512.366077901012, 5519.068326085838, 5552.972235138798, 3105.1926499110396, 3111.3310638212893, 3139.262273365757, 3140.5553445414907, 3157.4158780625658, 5854.414558544111, 6010.579259451796, 6035.521297282194, 6051.122587224916, 6101.505131242785, 5890.9410905891245, 5919.526437884959, 5924.496417804448, 5945.940540594539, 5967.283925928829, 5788.565857560699, 5933.554983376178, 5961.701914904237, 5963.2844058713235, 6040.4563589276295, 5730.942690573041, 5755.223044888887, 6055.636661800306, 6168.444839964424, 6172.753089876354, 6007.88854062, 6043.425874541911, 6063.393660634078, 6077.6353418795015, 6093.48205402528, 6115.510759139347, 6231.501479881508, 6254.499640028877, 6305.905411418924, 6305.905411418924, 4479.529649386898, 4486.7756612168605, 4497.932531012103, 4521.547845215452, 4525.823285945744, 5887.499562537232, 6027.487663548647, 6047.455728984412, 6051.4553690168095, 6087.391260873877, 5927.8221653350465, 5969.791057312973, 5987.131865879336, 5998.7300571473515, 6012.609180403259, 5884.823455296348, 5942.30644266382, 5952.934238867074, 5998.580099393001, 6011.248593925759, 5767.884642307215, 5796.82609521715, 5861.648301101947, 5912.615679980788, 5938.346781853907, 5993.130996005642, 5997.0, 6033.909491357721, 6051.788187413596, 6052.939470605237, 5668.603197776116, 5856.824295271149, 5882.735276912464, 5888.587798854039, 5901.380355062828], "value": 4497.910826300217, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [806.0448368683111, 823.686998940403, 848.8854004709365, 852.4160949749419, 892.7277180459961, 13956.232407217625, 14010.509632162877, 14107.15357078576, 14166.575002749922, 15912.443064492745, 14147.504837330696, 14216.573502794932, 14230.146191228534, 14268.714625707506, 14299.78550321746, 849.4308813095241, 853.6798700487317, 855.5764896376271, 863.9179277968583, 864.7405778266526, 846.6401779243828, 865.6840253307529, 866.2247288676631, 870.7779516223354, 871.020102384817, 893.6202114101513, 899.7705585075796, 899.9235065019482, 903.0, 904.0417157812707, 893.5175005497024, 894.3471265975809, 895.4492986813128, 897.7261935109789, 900.8198360327928, 662.4104546953215, 662.5825729790249, 665.2449469851705, 665.4576520136122, 666.473485946102, 13817.309134543233, 13862.722745545032, 13961.0, 13973.0, 14733.189674567895, 13433.0, 13945.372458239302, 14205.857941420556, 14211.78682319766, 14590.562283131418, 12255.816162757566, 12325.69185770354, 12457.75084498314, 12510.81233781494, 12575.685607859785, 3709.9814500927323, 3763.172102137553, 3793.013816407726, 3795.8291876865605, 3849.615038496156, 65441.0, 66203.0, 66705.66647166782, 66795.33204667988, 67469.66265168691, 10946.781064378667, 11026.614068507564, 11145.609903653332, 11228.55085796559, 11434.771304573862, 20649.0, 20660.690089648666, 20677.0695318711, 20724.58550828975, 20739.792602073787, 8499.320054395634, 8626.568671566396, 8645.610947507377, 8719.869201961976, 8963.417377870417, 4437.2234858899565, 4499.190145773727, 4618.468876079227, 4830.275458681226, 4940.456549779521, 3544.5392099027476, 3662.212624285791, 3673.118451571657, 3677.79772112531, 3677.9448308275396, 587.4272584230426, 598.6946657204857, 608.2123649873424, 619.4486906653083, 619.557016733038, 713.12642013533, 715.889037199235, 766.1495739728897, 789.960501974899, 813.016250337087, 9258.213051890665, 10022.398656080513, 10325.32885362449, 10550.261481696361, 10786.352818830896, 674.2953613473932, 689.9724011039602, 745.5563939456015, 776.5418403142173, 804.5856383962264, 4804.759762011886, 5022.6233032522705, 5059.924101138486, 5145.562627176657, 5196.76614552346, 71248.0, 90512.0, 90917.0, 91936.54031729799, 93012.53493732623, 46964.29553556699, 59167.112493312634, 64521.35478645247, 64637.676811616584, 69575.30424695688, 50775.492245077075, 63275.68362158252, 64665.67667161634, 64889.67555162288, 67026.66486667536, 10140.391576505433, 10510.632127875488, 10575.894241057491, 10619.469026548797, 10652.573897044342, 46154.53845461637, 46424.30363544482, 46878.0, 47674.0, 47895.28157077577, 57895.71052144712, 63068.36931630625, 63243.367566325585, 63526.0, 64387.356126438135, 13019.609411717664, 13821.516246931711, 14114.082584631966, 14171.574852754435, 14378.496752613608, 14720.411183552538, 14925.17911514877, 14953.551393458214, 15102.773458398353, 15963.840361596236, 14288.57134285973, 14293.0, 14326.641833953818, 14639.48761793332, 14683.804422099576, 13445.193288402726, 13649.590512284647, 13750.449982000608, 13932.233727145105, 14220.715585688435, 12498.812517812423, 12833.486660533474, 13113.606591802261, 13754.65613359674, 14184.716305674036, 11214.775704486028, 11612.767744645229, 11687.824682629598, 11762.94118529402, 11805.291682499077, 11770.115861765426, 11968.16222864391, 12147.460328459762, 12246.387680616112, 12391.93804030974], "value": 7409.768734714288, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1477.1999999999998, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 112.0, 113.0, 112.0, 112.0, 113.0, 112.0, 112.0, 112.0, 112.0], "value": 111.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 123.0, 126.0, 165.0, 134.0, 128.0, 123.0, 125.0, 146.0, 122.0], "value": 134.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 164.0, 162.0, 163.0, 162.0, 162.0, 161.0, 163.0, 164.0], "value": 162.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 75.0, 77.0, 105.0, 77.0, 77.0, 76.0, 75.0, 101.0, 76.0], "value": 81.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 120.0, 82.0, 84.0, 82.0, 97.0, 81.0, 84.0, 119.0], "value": 91.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 118.0, 117.0, 119.0, 119.0, 118.0, 118.0, 117.0, 119.0, 118.0], "value": 118.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 148.0, 146.0, 146.0, 148.0, 148.0, 147.0, 148.0, 148.0, 147.0], "value": 147.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 85.0, 85.0, 87.0, 85.0, 85.0, 85.0, 86.0, 86.0], "value": 85.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 52.0, 55.0, 52.0, 53.0, 52.0, 51.0, 52.0, 51.0, 52.0], "value": 52.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 58.0, 58.0, 58.0, 58.0, 57.0, 58.0, 58.0, 58.0, 58.0], "value": 57.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 81.0, 76.0, 80.0, 76.0, 76.0, 77.0, 82.0, 82.0], "value": 78.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [129.0, 136.0, 134.0, 144.0, 132.0, 127.0, 130.0, 129.0, 166.0, 143.0], "value": 137.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [157.0, 158.0, 153.0, 153.0, 157.0, 154.0, 154.0, 161.0, 156.0, 153.0], "value": 155.6, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 63.0, 64.0, 64.0, 68.0, 67.0, 63.0, 62.0, 63.0], "value": 64.3, "unit": "score"}]}]} 16:13:35 INFO - Return code: 0 16:13:35 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:13:35 ERROR - # TBPL SUCCESS # 16:13:35 INFO - Running post-action listener: _resource_record_post_action 16:13:35 INFO - [mozharness: 2016-12-08 00:13:35.925184Z] Finished run-tests step (success) 16:13:35 INFO - Running post-run listener: _resource_record_post_run 16:13:36 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 270336; Write bytes: 370176000; Read time: 124; Write time: 247076 16:13:36 INFO - TinderboxPrint: CPU usage
13.3% 16:13:36 INFO - TinderboxPrint: I/O read bytes / time
270,336 / 124 16:13:36 INFO - TinderboxPrint: I/O write bytes / time
370,176,000 / 247,076 16:13:36 INFO - TinderboxPrint: CPU idle
8,234.8 (86.7%) 16:13:36 INFO - TinderboxPrint: CPU user
1,206.7 (12.7%) 16:13:36 INFO - TinderboxPrint: Swap in / out
0 / 0 16:13:36 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 123969536; Read time: 0; Write time: 100976 16:13:36 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 266240; Write bytes: 246206464; Read time: 116; Write time: 146100 16:13:36 INFO - Running post-run listener: _upload_blobber_files 16:13:36 INFO - Blob upload gear active. 16:13:36 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:13:36 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 16:13:36 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', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:13:36 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 Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:13:37 INFO - (blobuploader) - INFO - Open directory for files ... 16:13:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 16:13:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:13:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:13:37 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 16:13:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:13:37 INFO - (blobuploader) - INFO - Done attempting. 16:13:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:13:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:13:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:13:41 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:13:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:13:41 INFO - (blobuploader) - INFO - Done attempting. 16:13:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 16:13:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:13:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:13:42 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 16:13:42 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:13:42 INFO - (blobuploader) - INFO - Done attempting. 16:13:42 INFO - (blobuploader) - INFO - Iteration through files over. 16:13:42 INFO - Return code: 0 16:13:42 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:13:42 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:13:42 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e9a5f41ed11750d99fb4cfb352e4f267858f6042d9441c5f3002a47465a1b5f14d1e84de5056068570045f4faceb11930d7c53cd213b44843ddaa3fd62a0002b", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/49a5eb8f0bf62ff3cbde77758a518a0dc0824d6b025429ae1c31ec7b31292a5468564e3f98b023c621a9cadf82805eb8627cb5a33d4b2baaaf0e5711b8e5b61c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7850d85834f55efe07ebda393f77c4fff4ea1684f36efea537d85da19390cec57d4c2461c95a59807e3d262aaa5e35b902674cefd24aaf4df911fc895d7d61da"} 16:13:42 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:13:42 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:13:42 INFO - Contents: 16:13:42 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e9a5f41ed11750d99fb4cfb352e4f267858f6042d9441c5f3002a47465a1b5f14d1e84de5056068570045f4faceb11930d7c53cd213b44843ddaa3fd62a0002b", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/49a5eb8f0bf62ff3cbde77758a518a0dc0824d6b025429ae1c31ec7b31292a5468564e3f98b023c621a9cadf82805eb8627cb5a33d4b2baaaf0e5711b8e5b61c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7850d85834f55efe07ebda393f77c4fff4ea1684f36efea537d85da19390cec57d4c2461c95a59807e3d262aaa5e35b902674cefd24aaf4df911fc895d7d61da"} 16:13:42 INFO - Running post-run listener: copy_logs_to_upload_dir 16:13:42 INFO - Copying logs to upload dir... 16:13:42 INFO - mkdir: /builds/slave/test/build/upload/logs 16:13:42 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.004502 ========= master_lag: 0.08 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-12-07 16:13:41.349295) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-07 16:13:41.357260) ========= 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: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1481151360.701757-1474587745 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e9a5f41ed11750d99fb4cfb352e4f267858f6042d9441c5f3002a47465a1b5f14d1e84de5056068570045f4faceb11930d7c53cd213b44843ddaa3fd62a0002b", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/49a5eb8f0bf62ff3cbde77758a518a0dc0824d6b025429ae1c31ec7b31292a5468564e3f98b023c621a9cadf82805eb8627cb5a33d4b2baaaf0e5711b8e5b61c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7850d85834f55efe07ebda393f77c4fff4ea1684f36efea537d85da19390cec57d4c2461c95a59807e3d262aaa5e35b902674cefd24aaf4df911fc895d7d61da"} build_url:https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011326 build_url: 'https://queue.taskcluster.net/v1/task/fOFPeh0_StqQXaoWpCw7AA/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/e9a5f41ed11750d99fb4cfb352e4f267858f6042d9441c5f3002a47465a1b5f14d1e84de5056068570045f4faceb11930d7c53cd213b44843ddaa3fd62a0002b", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/49a5eb8f0bf62ff3cbde77758a518a0dc0824d6b025429ae1c31ec7b31292a5468564e3f98b023c621a9cadf82805eb8627cb5a33d4b2baaaf0e5711b8e5b61c", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7850d85834f55efe07ebda393f77c4fff4ea1684f36efea537d85da19390cec57d4c2461c95a59807e3d262aaa5e35b902674cefd24aaf4df911fc895d7d61da"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-07 16:13:41.385298) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-07 16:13:41.385627) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=4300f881736b422476174874000001bc-1481151360.701757-1474587745 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004455 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-07 16:13:41.434574) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-07 16:13:41.437913) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-07 16:13:41.438204) ========= ========= Total master_lag: 0.20 =========