builder: mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-062 starttime: 1485971049.13 results: success (0) buildid: 20170201074109 builduid: e435f4adfb3a4a929de186600de872fb revision: 44777332a82750e2440b88f61a8db6b463377665 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.128859) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.129326) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.129651) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.146102) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.146395) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-02-01 09:44:09-- 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% 53.5M=0s 2017-02-01 09:44:09 (53.5 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.145077 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.308763) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.309470) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014894 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.361025) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.361400) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-beta --rev 44777332a82750e2440b88f61a8db6b463377665 --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-beta --rev 44777332a82750e2440b88f61a8db6b463377665 --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=a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-02-01 09:44:10,030 truncating revision to first 12 chars 2017-02-01 09:44:10,030 Setting DEBUG logging. 2017-02-01 09:44:10,030 attempt 1/10 2017-02-01 09:44:10,030 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-beta/44777332a827?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-01 09:44:10,331 unpacking tar archive at: mozilla-beta-44777332a827/testing/mozharness/ program finished with exit code 0 elapsedTime=0.608715 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.983831) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.984196) ========= script_repo_revision: 44777332a82750e2440b88f61a8db6b463377665 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.984676) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.984981) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-01 09:44:09.994046) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 29 secs) (at 2017-02-01 09:44:09.994379) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 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-Beta', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Beta'] 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=a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:44:10 INFO - MultiFileLogger online at 20170201 09:44:10 in /builds/slave/test 09:44:10 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Beta --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Beta 09:44:10 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:44:10 INFO - {'append_to_log': False, 09:44:10 INFO - 'base_work_dir': '/builds/slave/test', 09:44:10 INFO - 'blob_upload_branch': 'Mozilla-Beta', 09:44:10 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:44:10 INFO - 'branch': 'Mozilla-Beta', 09:44:10 INFO - 'buildbot_json_path': 'buildprops.json', 09:44:10 INFO - 'config_files': ('talos/linux_config.py',), 09:44:10 INFO - 'default_actions': ('clobber', 09:44:10 INFO - 'read-buildbot-config', 09:44:10 INFO - 'download-and-extract', 09:44:10 INFO - 'populate-webroot', 09:44:10 INFO - 'create-virtualenv', 09:44:10 INFO - 'install', 09:44:10 INFO - 'run-tests'), 09:44:10 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:44:10 INFO - 'download_minidump_stackwalk': True, 09:44:10 INFO - 'download_symbols': 'ondemand', 09:44:10 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:44:10 INFO - 'tooltool.py': '/tools/tooltool.py', 09:44:10 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:44:10 INFO - '/tools/misc-python/virtualenv.py')}, 09:44:10 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:44:10 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:44:10 INFO - 'installer_path': 'installer.exe', 09:44:10 INFO - 'log_level': 'info', 09:44:10 INFO - 'log_name': 'talos', 09:44:10 INFO - 'log_to_console': True, 09:44:10 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:44:10 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:44:10 INFO - 'opt_config_files': (), 09:44:10 INFO - 'pip_index': False, 09:44:10 INFO - 'sps_profile': False, 09:44:10 INFO - 'sps_profile_interval': 0, 09:44:10 INFO - 'suite': 'dromaeojs-e10s', 09:44:10 INFO - 'system_bits': '32', 09:44:10 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:44:10 INFO - 'title': 'talos-linux64-ix-062', 09:44:10 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:44:10 INFO - 'use_talos_json': True, 09:44:10 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:44:10 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:44:10 INFO - 'work_dir': 'build'} 09:44:10 INFO - [mozharness: 2017-02-01 17:44:10.764590Z] Running clobber step. 09:44:10 INFO - Running pre-action listener: _resource_record_pre_action 09:44:10 INFO - Running main action method: clobber 09:44:10 INFO - rmtree: /builds/slave/test/build 09:44:10 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:44:11 INFO - Running post-action listener: _resource_record_post_action 09:44:11 INFO - [mozharness: 2017-02-01 17:44:11.239976Z] Finished clobber step (success) 09:44:11 INFO - [mozharness: 2017-02-01 17:44:11.240086Z] Running read-buildbot-config step. 09:44:11 INFO - Running pre-action listener: _resource_record_pre_action 09:44:11 INFO - Running main action method: read_buildbot_config 09:44:11 INFO - Using buildbot properties: 09:44:11 INFO - { 09:44:11 INFO - "project": "", 09:44:11 INFO - "product": "firefox", 09:44:11 INFO - "script_repo_revision": "production", 09:44:11 INFO - "builddir": "mozilla-beta_ubuntu64_hw_test-dromaeojs-e10s", 09:44:11 INFO - "repository": "", 09:44:11 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-beta pgo talos dromaeojs-e10s", 09:44:11 INFO - "buildid": "20170201074109", 09:44:11 INFO - "pgo_build": "True", 09:44:11 INFO - "basedir": "/builds/slave/test", 09:44:11 INFO - "buildnumber": 384, 09:44:11 INFO - "slavename": "talos-linux64-ix-062", 09:44:11 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 09:44:11 INFO - "platform": "ubuntu64_hw", 09:44:11 INFO - "scheduler": "tests-mozilla-beta-linux64-pgo-talos", 09:44:11 INFO - "branch": "mozilla-beta", 09:44:11 INFO - "repo_path": "releases/mozilla-beta", 09:44:11 INFO - "revision": "44777332a82750e2440b88f61a8db6b463377665", 09:44:11 INFO - "stage_platform": "linux64-pgo", 09:44:11 INFO - "builduid": "e435f4adfb3a4a929de186600de872fb", 09:44:11 INFO - "slavebuilddir": "test" 09:44:11 INFO - } 09:44:11 INFO - Found installer url https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2. 09:44:11 INFO - Running post-action listener: _resource_record_post_action 09:44:11 INFO - [mozharness: 2017-02-01 17:44:11.242848Z] Finished read-buildbot-config step (success) 09:44:11 INFO - [mozharness: 2017-02-01 17:44:11.242937Z] Running download-and-extract step. 09:44:11 INFO - Running pre-action listener: _resource_record_pre_action 09:44:11 INFO - Running main action method: download_and_extract 09:44:11 INFO - mkdir: /builds/slave/test/build/tests 09:44:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:44:11 INFO - trying https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.test_packages.json 09:44:11 INFO - Downloading https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.test_packages.json 09:44:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.test_packages.json'}, attempt #1 09:44:11 INFO - Downloaded 1327 bytes. 09:44:11 INFO - Reading from file /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.test_packages.json 09:44:11 INFO - Using the following test package requirements: 09:44:11 INFO - {u'common': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip'], 09:44:11 INFO - u'cppunittest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 09:44:11 INFO - u'firefox-52.0.en-US.linux-x86_64.cppunittest.tests.zip'], 09:44:11 INFO - u'gtest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 09:44:11 INFO - u'firefox-52.0.en-US.linux-x86_64.gtest.tests.zip'], 09:44:11 INFO - u'jittest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 09:44:11 INFO - u'jsshell-linux-x86_64.zip'], 09:44:11 INFO - u'mochitest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 09:44:11 INFO - u'firefox-52.0.en-US.linux-x86_64.mochitest.tests.zip'], 09:44:11 INFO - u'mozbase': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip'], 09:44:11 INFO - u'reftest': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 09:44:11 INFO - u'firefox-52.0.en-US.linux-x86_64.reftest.tests.zip'], 09:44:11 INFO - u'talos': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 09:44:11 INFO - u'firefox-52.0.en-US.linux-x86_64.talos.tests.zip'], 09:44:11 INFO - u'web-platform': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 09:44:11 INFO - u'firefox-52.0.en-US.linux-x86_64.web-platform.tests.zip'], 09:44:11 INFO - u'xpcshell': [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', 09:44:11 INFO - u'firefox-52.0.en-US.linux-x86_64.xpcshell.tests.zip']} 09:44:11 INFO - Downloading packages: [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 09:44:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip 09:44:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:44:11 INFO - Fetch https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip into memory 09:44:12 INFO - Http code: 200 09:44:12 INFO - via: 1.1 423912f2b1c5569e2fa5017167c61fa0.cloudfront.net (CloudFront) 09:44:12 INFO - x-amz-cf-id: FcgpjM06UGpHyOA6a2HFDT6yJyQy9LpNJg0umRAgWG762o8QxwzByg== 09:44:12 INFO - x-amz-version-id: x9tt8kknb7X.oqSqOq052NGl.KI4Lldk 09:44:12 INFO - Expected file size: 21954881 09:44:12 INFO - Obtained file size: 21954881 09:44:16 INFO - Downloading packages: [u'firefox-52.0.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 09:44:16 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip 09:44:16 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip'}, attempt #1 09:44:16 INFO - Fetch https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.common.tests.zip into memory 09:44:17 INFO - Http code: 200 09:44:17 INFO - via: 1.1 ff555a0cc6346f82fe74596f8ed6cc33.cloudfront.net (CloudFront) 09:44:17 INFO - x-amz-cf-id: 7PiFPOmwbCESR4QeGm6qRlf9kcT_CrrG1lwATLEO7cxRZo2ekgZbBQ== 09:44:17 INFO - x-amz-version-id: x9tt8kknb7X.oqSqOq052NGl.KI4Lldk 09:44:17 INFO - Expected file size: 21954881 09:44:17 INFO - Obtained file size: 21954881 09:44:21 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.talos.tests.zip 09:44:21 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 09:44:21 INFO - Fetch https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.talos.tests.zip into memory 09:44:22 INFO - Http code: 200 09:44:22 INFO - via: 1.1 b3bccc0e4c2cc0a33e7e8308d88cacdd.cloudfront.net (CloudFront) 09:44:22 INFO - x-amz-cf-id: 5CvEALVySCtxcYpRHUZafdEIsDaLUrszsIAV27y0Al3YbHnJSuu-SA== 09:44:22 INFO - x-amz-version-id: QGzsGP21OIWfscbqWrGjmwd5EStoGM02 09:44:22 INFO - Expected file size: 14403005 09:44:22 INFO - Obtained file size: 14403005 09:44:22 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')]} 09:44:22 INFO - trying https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 09:44:22 INFO - Downloading https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 09:44:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2'}, attempt #1 09:44:23 INFO - Downloaded 57692880 bytes. 09:44:23 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 09:44:23 INFO - mkdir: /builds/slave/test/properties 09:44:23 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:44:23 INFO - Writing to file /builds/slave/test/properties/build_url 09:44:23 INFO - Contents: 09:44:23 INFO - build_url:https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 09:44:24 INFO - Running post-action listener: _resource_record_post_action 09:44:24 INFO - Running post-action listener: set_extra_try_arguments 09:44:24 INFO - [mozharness: 2017-02-01 17:44:24.655693Z] Finished download-and-extract step (success) 09:44:24 INFO - [mozharness: 2017-02-01 17:44:24.655923Z] Running populate-webroot step. 09:44:24 INFO - Running pre-action listener: _resource_record_pre_action 09:44:24 INFO - Running main action method: populate_webroot 09:44:24 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:44:24 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:44:24 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:44:24 INFO - '--tppagecycles', 09:44:24 INFO - '7'], 09:44:24 INFO - 'tests': ['tsvgm']}}, 09:44:24 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:44:24 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 09:44:24 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:44:24 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 09:44:24 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:44:24 INFO - 'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:44:24 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:44:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:44:24 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:44:24 INFO - 'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['damp', 'tps']}, 09:44:24 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:44:24 INFO - 'tests': ['damp', 'tps']}, 09:44:24 INFO - 'g3': {'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['dromaeo_dom']}, 09:44:24 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:44:24 INFO - 'g4': {'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['basic_compositor_video']}, 09:44:24 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 09:44:24 INFO - 'other': {'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['a11yr', 09:44:24 INFO - 'ts_paint', 09:44:24 INFO - 'tpaint', 09:44:24 INFO - 'sessionrestore', 09:44:24 INFO - 'sessionrestore_no_auto_restore', 09:44:24 INFO - 'tabpaint']}, 09:44:24 INFO - 'other-e10s': {'tests': ['a11yr', 09:44:24 INFO - 'ts_paint', 09:44:24 INFO - 'tpaint', 09:44:24 INFO - 'sessionrestore', 09:44:24 INFO - 'sessionrestore_no_auto_restore', 09:44:24 INFO - 'tabpaint']}, 09:44:24 INFO - 'other-e10s_l64': {'tests': ['a11yr', 09:44:24 INFO - 'ts_paint', 09:44:24 INFO - 'tpaint', 09:44:24 INFO - 'sessionrestore', 09:44:24 INFO - 'sessionrestore_no_auto_restore', 09:44:24 INFO - 'tabpaint']}, 09:44:24 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 09:44:24 INFO - 'ts_paint', 09:44:24 INFO - 'tpaint', 09:44:24 INFO - 'sessionrestore', 09:44:24 INFO - 'sessionrestore_no_auto_restore', 09:44:24 INFO - 'tabpaint']}, 09:44:24 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['a11yr', 09:44:24 INFO - 'ts_paint', 09:44:24 INFO - 'tpaint', 09:44:24 INFO - 'sessionrestore', 09:44:24 INFO - 'sessionrestore_no_auto_restore', 09:44:24 INFO - 'tabpaint']}, 09:44:24 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['a11yr', 09:44:24 INFO - 'ts_paint', 09:44:24 INFO - 'tpaint', 09:44:24 INFO - 'sessionrestore', 09:44:24 INFO - 'sessionrestore_no_auto_restore', 09:44:24 INFO - 'tabpaint']}, 09:44:24 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['tsvgx', 09:44:24 INFO - 'tsvgr_opacity', 09:44:24 INFO - 'tart', 09:44:24 INFO - 'tscrollx', 09:44:24 INFO - 'cart']}, 09:44:24 INFO - 'svgr-e10s': {'tests': ['tsvgx', 09:44:24 INFO - 'tsvgr_opacity', 09:44:24 INFO - 'tart', 09:44:24 INFO - 'tscrollx', 09:44:24 INFO - 'cart']}, 09:44:24 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:44:24 INFO - 'talos_options': ['--disable-e10s'], 09:44:24 INFO - 'tests': ['tp5o']}, 09:44:24 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:44:24 INFO - 'tests': ['tp5o']}, 09:44:24 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:44:24 INFO - 'talos_options': ['--disable-e10s', 09:44:24 INFO - '--xperf_path', 09:44:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:44:24 INFO - 'tests': ['tp5n']}, 09:44:24 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:44:24 INFO - 'talos_options': ['--xperf_path', 09:44:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:44:24 INFO - 'tests': ['tp5n']}}, 09:44:24 INFO - 'talos.zip': {'path': '', 09:44:24 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:44:24 INFO - Running post-action listener: _resource_record_post_action 09:44:24 INFO - [mozharness: 2017-02-01 17:44:24.672432Z] Finished populate-webroot step (success) 09:44:24 INFO - [mozharness: 2017-02-01 17:44:24.672522Z] Running create-virtualenv step. 09:44:24 INFO - Running pre-action listener: _resource_record_pre_action 09:44:24 INFO - Running main action method: create_virtualenv 09:44:24 INFO - Creating virtualenv /builds/slave/test/build/venv 09:44:24 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 09:44:24 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:44:24 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:44:24 INFO - Using real prefix '/usr' 09:44:24 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:44:25 INFO - Installing distribute.............................................................................................................................................................................................done. 09:44:27 INFO - Installing pip.................done. 09:44:27 INFO - Return code: 0 09:44:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 09:44:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 09:44:27 INFO - Reading from file tmpfile_stdout 09:44:27 INFO - Output received: 09:44:27 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) 09:44:27 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:44: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')]} 09:44:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44: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')]} 09:44:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44: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', 'pip>=1.5'] in /builds/slave/test/build 09:44: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 pip>=1.5 09:44:27 INFO - Using env: {'DISPLAY': ':0', 09:44:27 INFO - 'HOME': '/home/cltbld', 09:44:27 INFO - 'LANG': 'en_US.UTF-8', 09:44:27 INFO - 'LANGUAGE': 'en_US:en', 09:44:27 INFO - 'LOGNAME': 'cltbld', 09:44:27 INFO - 'MAIL': '/var/mail/cltbld', 09:44:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:27 INFO - 'MOZ_NO_REMOTE': '1', 09:44:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:27 INFO - 'NO_EM_RESTART': '1', 09:44:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:27 INFO - 'PWD': '/builds/slave/test', 09:44:27 INFO - 'SHELL': '/bin/bash', 09:44:27 INFO - 'SHLVL': '1', 09:44:27 INFO - 'TERM': 'linux', 09:44:27 INFO - 'TMOUT': '86400', 09:44:27 INFO - 'USER': 'cltbld', 09:44:27 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:27 INFO - '_': '/tools/buildbot/bin/python'} 09:44:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:27 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 09:44:27 INFO - Cleaning up... 09:44:27 INFO - Return code: 0 09:44:27 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 09:44: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')]} 09:44:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44: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')]} 09:44:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44: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', '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 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44: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', 'psutil>=3.1.1'] in /builds/slave/test/build 09:44: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 psutil>=3.1.1 09:44:27 INFO - Using env: {'DISPLAY': ':0', 09:44:27 INFO - 'HOME': '/home/cltbld', 09:44:27 INFO - 'LANG': 'en_US.UTF-8', 09:44:27 INFO - 'LANGUAGE': 'en_US:en', 09:44:27 INFO - 'LOGNAME': 'cltbld', 09:44:27 INFO - 'MAIL': '/var/mail/cltbld', 09:44:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:27 INFO - 'MOZ_NO_REMOTE': '1', 09:44:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:27 INFO - 'NO_EM_RESTART': '1', 09:44:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:27 INFO - 'PWD': '/builds/slave/test', 09:44:27 INFO - 'SHELL': '/bin/bash', 09:44:27 INFO - 'SHLVL': '1', 09:44:27 INFO - 'TERM': 'linux', 09:44:27 INFO - 'TMOUT': '86400', 09:44:27 INFO - 'USER': 'cltbld', 09:44:27 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:27 INFO - '_': '/tools/buildbot/bin/python'} 09:44:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:27 INFO - Downloading/unpacking psutil>=3.1.1 09:44:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:44:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:44:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:44:30 INFO - Installing collected packages: psutil 09:44:30 INFO - Running setup.py install for psutil 09:44:30 INFO - building 'psutil._psutil_linux' extension 09:44:30 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 09:44:30 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 09:44:30 INFO - building 'psutil._psutil_posix' extension 09:44:30 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 09:44:30 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 09:44:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:44:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:44:30 INFO - Successfully installed psutil 09:44:30 INFO - Cleaning up... 09:44:30 INFO - Return code: 0 09:44:30 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 09:44: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')]} 09:44:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44: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')]} 09:44:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 09:44: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 mozsystemmonitor==0.3 09:44:30 INFO - Using env: {'DISPLAY': ':0', 09:44:30 INFO - 'HOME': '/home/cltbld', 09:44:30 INFO - 'LANG': 'en_US.UTF-8', 09:44:30 INFO - 'LANGUAGE': 'en_US:en', 09:44:30 INFO - 'LOGNAME': 'cltbld', 09:44:30 INFO - 'MAIL': '/var/mail/cltbld', 09:44:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:30 INFO - 'MOZ_NO_REMOTE': '1', 09:44:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:30 INFO - 'NO_EM_RESTART': '1', 09:44:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:30 INFO - 'PWD': '/builds/slave/test', 09:44:30 INFO - 'SHELL': '/bin/bash', 09:44:30 INFO - 'SHLVL': '1', 09:44:30 INFO - 'TERM': 'linux', 09:44:30 INFO - 'TMOUT': '86400', 09:44:30 INFO - 'USER': 'cltbld', 09:44:30 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:30 INFO - '_': '/tools/buildbot/bin/python'} 09:44:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:30 INFO - Downloading/unpacking mozsystemmonitor==0.3 09:44: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 09:44: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 09:44: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 09:44: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 09:44: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 09:44: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 09:44:32 INFO - Downloading mozsystemmonitor-0.3.tar.gz 09:44:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:44:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 09:44:32 INFO - Installing collected packages: mozsystemmonitor 09:44:32 INFO - Running setup.py install for mozsystemmonitor 09:44:32 INFO - Successfully installed mozsystemmonitor 09:44:32 INFO - Cleaning up... 09:44:33 INFO - Return code: 0 09:44:33 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 09:44: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')]} 09:44:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44: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')]} 09:44:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44: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', '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 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44: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', 'jsonschema==2.5.1'] in /builds/slave/test/build 09:44: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 jsonschema==2.5.1 09:44:33 INFO - Using env: {'DISPLAY': ':0', 09:44:33 INFO - 'HOME': '/home/cltbld', 09:44:33 INFO - 'LANG': 'en_US.UTF-8', 09:44:33 INFO - 'LANGUAGE': 'en_US:en', 09:44:33 INFO - 'LOGNAME': 'cltbld', 09:44:33 INFO - 'MAIL': '/var/mail/cltbld', 09:44:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:33 INFO - 'MOZ_NO_REMOTE': '1', 09:44:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:33 INFO - 'NO_EM_RESTART': '1', 09:44:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:33 INFO - 'PWD': '/builds/slave/test', 09:44:33 INFO - 'SHELL': '/bin/bash', 09:44:33 INFO - 'SHLVL': '1', 09:44:33 INFO - 'TERM': 'linux', 09:44:33 INFO - 'TMOUT': '86400', 09:44:33 INFO - 'USER': 'cltbld', 09:44:33 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:33 INFO - '_': '/tools/buildbot/bin/python'} 09:44:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:33 INFO - Downloading/unpacking jsonschema==2.5.1 09:44: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 09:44: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 09:44: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 09:44: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 09:44: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 09:44: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 09:44:35 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:44:35 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 09:44: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 09:44: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 09:44: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 09:44: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 09:44: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 09:44: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 09:44:35 INFO - Downloading functools32-3.2.3-2.tar.gz 09:44:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:44:35 INFO - warning: no files found matching '*.txt' 09:44:35 INFO - no previously-included directories found matching 'build' 09:44:35 INFO - no previously-included directories found matching 'dist' 09:44:35 INFO - no previously-included directories found matching '.git*' 09:44:35 INFO - Installing collected packages: jsonschema, functools32 09:44:35 INFO - Running setup.py install for functools32 09:44:35 INFO - warning: no files found matching '*.txt' 09:44:35 INFO - no previously-included directories found matching 'build' 09:44:35 INFO - no previously-included directories found matching 'dist' 09:44:35 INFO - no previously-included directories found matching '.git*' 09:44:35 INFO - Successfully installed jsonschema functools32 09:44:35 INFO - Cleaning up... 09:44:35 INFO - Return code: 0 09:44:35 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 09:44:35 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')]} 09:44:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:35 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')]} 09:44:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:35 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 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44:35 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 09:44:35 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 09:44:35 INFO - Using env: {'DISPLAY': ':0', 09:44:35 INFO - 'HOME': '/home/cltbld', 09:44:35 INFO - 'LANG': 'en_US.UTF-8', 09:44:35 INFO - 'LANGUAGE': 'en_US:en', 09:44:35 INFO - 'LOGNAME': 'cltbld', 09:44:35 INFO - 'MAIL': '/var/mail/cltbld', 09:44:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:35 INFO - 'MOZ_NO_REMOTE': '1', 09:44:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:35 INFO - 'NO_EM_RESTART': '1', 09:44:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:35 INFO - 'PWD': '/builds/slave/test', 09:44:35 INFO - 'SHELL': '/bin/bash', 09:44:35 INFO - 'SHLVL': '1', 09:44:35 INFO - 'TERM': 'linux', 09:44:35 INFO - 'TMOUT': '86400', 09:44:35 INFO - 'USER': 'cltbld', 09:44:35 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:35 INFO - '_': '/tools/buildbot/bin/python'} 09:44:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:35 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 09:44:35 INFO - Cleaning up... 09:44:35 INFO - Return code: 0 09:44:35 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:44:35 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')]} 09:44:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:35 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')]} 09:44:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:35 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 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44:35 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 09:44:35 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 09:44:35 INFO - Using env: {'DISPLAY': ':0', 09:44:35 INFO - 'HOME': '/home/cltbld', 09:44:35 INFO - 'LANG': 'en_US.UTF-8', 09:44:35 INFO - 'LANGUAGE': 'en_US:en', 09:44:35 INFO - 'LOGNAME': 'cltbld', 09:44:35 INFO - 'MAIL': '/var/mail/cltbld', 09:44:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:35 INFO - 'MOZ_NO_REMOTE': '1', 09:44:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:35 INFO - 'NO_EM_RESTART': '1', 09:44:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:35 INFO - 'PWD': '/builds/slave/test', 09:44:35 INFO - 'SHELL': '/bin/bash', 09:44:35 INFO - 'SHLVL': '1', 09:44:35 INFO - 'TERM': 'linux', 09:44:35 INFO - 'TMOUT': '86400', 09:44:35 INFO - 'USER': 'cltbld', 09:44:35 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:35 INFO - '_': '/tools/buildbot/bin/python'} 09:44:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:36 INFO - Downloading/unpacking blobuploader==1.2.4 09:44:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:38 INFO - Downloading blobuploader-1.2.4.tar.gz 09:44:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:44:38 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:44:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:44:38 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:44:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:38 INFO - Downloading docopt-0.6.1.tar.gz 09:44:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:44:38 INFO - Installing collected packages: blobuploader, requests, docopt 09:44:38 INFO - Running setup.py install for blobuploader 09:44:39 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:44:39 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:44:39 INFO - Running setup.py install for requests 09:44:39 INFO - Running setup.py install for docopt 09:44:39 INFO - Successfully installed blobuploader requests docopt 09:44:39 INFO - Cleaning up... 09:44:39 INFO - Return code: 0 09:44:39 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:44:39 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')]} 09:44:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:39 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')]} 09:44:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:39 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 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44:39 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 09:44:39 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 09:44:39 INFO - Using env: {'DISPLAY': ':0', 09:44:39 INFO - 'HOME': '/home/cltbld', 09:44:39 INFO - 'LANG': 'en_US.UTF-8', 09:44:39 INFO - 'LANGUAGE': 'en_US:en', 09:44:39 INFO - 'LOGNAME': 'cltbld', 09:44:39 INFO - 'MAIL': '/var/mail/cltbld', 09:44:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:39 INFO - 'MOZ_NO_REMOTE': '1', 09:44:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:39 INFO - 'NO_EM_RESTART': '1', 09:44:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:39 INFO - 'PWD': '/builds/slave/test', 09:44:39 INFO - 'SHELL': '/bin/bash', 09:44:39 INFO - 'SHLVL': '1', 09:44:39 INFO - 'TERM': 'linux', 09:44:39 INFO - 'TMOUT': '86400', 09:44:39 INFO - 'USER': 'cltbld', 09:44:39 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:39 INFO - '_': '/tools/buildbot/bin/python'} 09:44:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:44:39 INFO - Running setup.py (path:/tmp/pip-Uj6TMf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:44:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:44:39 INFO - Running setup.py (path:/tmp/pip-Gio4fA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:44:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:44:39 INFO - Running setup.py (path:/tmp/pip-aHujRy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:44:40 INFO - Running setup.py (path:/tmp/pip-eWokjc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:44:40 INFO - Running setup.py (path:/tmp/pip-RiFbm8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:44:40 INFO - Running setup.py (path:/tmp/pip-v41GkO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:44:40 INFO - Running setup.py (path:/tmp/pip-XJRbun-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:44:40 INFO - Running setup.py (path:/tmp/pip-cLTpIa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:44:40 INFO - Running setup.py (path:/tmp/pip-orN1sk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:44:40 INFO - Running setup.py (path:/tmp/pip-Hx9FzE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:44:40 INFO - Running setup.py (path:/tmp/pip-wipKZH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:44:40 INFO - Running setup.py (path:/tmp/pip-BZELgg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:44:40 INFO - Running setup.py (path:/tmp/pip-M9z2FW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:44:40 INFO - Running setup.py (path:/tmp/pip-Z4rknd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:44:40 INFO - Running setup.py (path:/tmp/pip-AYgcXS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:44:40 INFO - Running setup.py (path:/tmp/pip-qdvaRb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:44:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:44:40 INFO - Running setup.py (path:/tmp/pip-BJCgZg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:44:41 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:44:41 INFO - Running setup.py install for manifestparser 09:44:41 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:44:41 INFO - Running setup.py install for mozcrash 09:44:41 INFO - Running setup.py install for mozdebug 09:44:41 INFO - Running setup.py install for mozdevice 09:44:41 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:44:41 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:44:41 INFO - Running setup.py install for mozfile 09:44:41 INFO - Running setup.py install for mozhttpd 09:44:41 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:44:41 INFO - Running setup.py install for mozinfo 09:44:41 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:44:41 INFO - Running setup.py install for mozInstall 09:44:41 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:44:41 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:44:41 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:44:41 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:44:41 INFO - Running setup.py install for mozleak 09:44:41 INFO - Running setup.py install for mozlog 09:44:42 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:44:42 INFO - Running setup.py install for moznetwork 09:44:42 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:44:42 INFO - Running setup.py install for mozprocess 09:44:42 INFO - Running setup.py install for mozprofile 09:44:42 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:44:42 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:44:42 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:44:42 INFO - Running setup.py install for mozrunner 09:44:42 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:44:42 INFO - Running setup.py install for mozscreenshot 09:44:42 INFO - Running setup.py install for moztest 09:44:42 INFO - Running setup.py install for mozversion 09:44:42 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:44:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:44:42 INFO - Cleaning up... 09:44:42 INFO - Return code: 0 09:44:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:44:42 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')]} 09:44:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:42 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')]} 09:44:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:42 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 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44:42 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 09:44:42 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 09:44:42 INFO - Using env: {'DISPLAY': ':0', 09:44:42 INFO - 'HOME': '/home/cltbld', 09:44:42 INFO - 'LANG': 'en_US.UTF-8', 09:44:42 INFO - 'LANGUAGE': 'en_US:en', 09:44:42 INFO - 'LOGNAME': 'cltbld', 09:44:42 INFO - 'MAIL': '/var/mail/cltbld', 09:44:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:42 INFO - 'MOZ_NO_REMOTE': '1', 09:44:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:42 INFO - 'NO_EM_RESTART': '1', 09:44:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:42 INFO - 'PWD': '/builds/slave/test', 09:44:42 INFO - 'SHELL': '/bin/bash', 09:44:42 INFO - 'SHLVL': '1', 09:44:42 INFO - 'TERM': 'linux', 09:44:42 INFO - 'TMOUT': '86400', 09:44:42 INFO - 'USER': 'cltbld', 09:44:42 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:42 INFO - '_': '/tools/buildbot/bin/python'} 09:44:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:44:43 INFO - Running setup.py (path:/tmp/pip-ZBTWrd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:44:43 INFO - Running setup.py (path:/tmp/pip-318yXu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:44:43 INFO - Running setup.py (path:/tmp/pip-ScIE5m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:44:43 INFO - Running setup.py (path:/tmp/pip-mJUd5y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:44:43 INFO - Running setup.py (path:/tmp/pip-FKbrWI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:44:43 INFO - Running setup.py (path:/tmp/pip-KNvsUw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:44:43 INFO - Running setup.py (path:/tmp/pip-VOpoVN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:44:43 INFO - Running setup.py (path:/tmp/pip-cewBI9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:44:43 INFO - Running setup.py (path:/tmp/pip-mMYIja-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:44:43 INFO - Running setup.py (path:/tmp/pip-LWF4FM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:44:43 INFO - Running setup.py (path:/tmp/pip-ylhVka-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:44:43 INFO - Running setup.py (path:/tmp/pip-ZrjhNC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:44:43 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)) 09:44:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:44:43 INFO - Running setup.py (path:/tmp/pip-_3tjnW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:44:44 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)) 09:44:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:44:44 INFO - Running setup.py (path:/tmp/pip-l1WHsS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:44:44 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)) 09:44:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:44:44 INFO - Running setup.py (path:/tmp/pip-B8wpFD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:44:44 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)) 09:44:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:44:44 INFO - Running setup.py (path:/tmp/pip-tJXbl3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:44:44 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 09:44:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:44:44 INFO - Running setup.py (path:/tmp/pip-LFJvG_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:44:44 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)) 09:44:44 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)) 09:44:44 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)) 09:44:44 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)) 09:44:44 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)) 09:44:44 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)) 09:44:44 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:44:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:44:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:44:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:44:46 INFO - Downloading blessings-1.6.tar.gz 09:44:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:44:46 INFO - Installing collected packages: blessings 09:44:46 INFO - Running setup.py install for blessings 09:44:46 INFO - Successfully installed blessings 09:44:46 INFO - Cleaning up... 09:44:46 INFO - Return code: 0 09:44:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:44:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:44:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:44:46 INFO - Reading from file tmpfile_stdout 09:44:46 INFO - Current package versions: 09:44:46 INFO - argparse == 1.2.1 09:44:46 INFO - blessings == 1.6 09:44:46 INFO - blobuploader == 1.2.4 09:44:46 INFO - docopt == 0.6.1 09:44:46 INFO - functools32 == 3.2.3-2 09:44:46 INFO - jsonschema == 2.5.1 09:44:46 INFO - manifestparser == 1.1 09:44:46 INFO - mozInstall == 1.12 09:44:46 INFO - mozcrash == 1.0 09:44:46 INFO - mozdebug == 0.1 09:44:46 INFO - mozdevice == 0.48 09:44:46 INFO - mozfile == 1.2 09:44:46 INFO - mozhttpd == 0.7 09:44:46 INFO - mozinfo == 0.9 09:44:46 INFO - mozleak == 0.1 09:44:46 INFO - mozlog == 3.4 09:44:46 INFO - moznetwork == 0.27 09:44:46 INFO - mozprocess == 0.23 09:44:46 INFO - mozprofile == 0.28 09:44:46 INFO - mozrunner == 6.13 09:44:46 INFO - mozscreenshot == 0.1 09:44:46 INFO - mozsystemmonitor == 0.3 09:44:46 INFO - moztest == 0.8 09:44:46 INFO - mozversion == 1.4 09:44:46 INFO - psutil == 3.1.1 09:44:46 INFO - requests == 1.2.3 09:44:46 INFO - wsgiref == 0.1.2 09:44:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:44:46 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')]} 09:44:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:46 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')]} 09:44:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:46 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 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44:46 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 09:44:46 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 09:44:46 INFO - Using env: {'DISPLAY': ':0', 09:44:46 INFO - 'HOME': '/home/cltbld', 09:44:46 INFO - 'LANG': 'en_US.UTF-8', 09:44:46 INFO - 'LANGUAGE': 'en_US:en', 09:44:46 INFO - 'LOGNAME': 'cltbld', 09:44:46 INFO - 'MAIL': '/var/mail/cltbld', 09:44:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:46 INFO - 'MOZ_NO_REMOTE': '1', 09:44:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:46 INFO - 'NO_EM_RESTART': '1', 09:44:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:46 INFO - 'PWD': '/builds/slave/test', 09:44:46 INFO - 'SHELL': '/bin/bash', 09:44:46 INFO - 'SHLVL': '1', 09:44:46 INFO - 'TERM': 'linux', 09:44:46 INFO - 'TMOUT': '86400', 09:44:46 INFO - 'USER': 'cltbld', 09:44:46 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:46 INFO - '_': '/tools/buildbot/bin/python'} 09:44:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:47 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)) 09:44:47 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)) 09:44:47 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)) 09:44:47 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)) 09:44:47 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)) 09:44:47 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)) 09:44:47 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)) 09:44:47 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)) 09:44:47 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)) 09:44:47 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)) 09:44:47 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)) 09:44:47 INFO - Cleaning up... 09:44:47 INFO - Return code: 0 09:44:47 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:44:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:44:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:44:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:44:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:44:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:44:47 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 0x7fb141e5df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16368a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1703ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, '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': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', '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 09:44:47 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 09:44:47 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 09:44:47 INFO - Using env: {'DISPLAY': ':0', 09:44:47 INFO - 'HOME': '/home/cltbld', 09:44:47 INFO - 'LANG': 'en_US.UTF-8', 09:44:47 INFO - 'LANGUAGE': 'en_US:en', 09:44:47 INFO - 'LOGNAME': 'cltbld', 09:44:47 INFO - 'MAIL': '/var/mail/cltbld', 09:44:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:44:47 INFO - 'MOZ_NO_REMOTE': '1', 09:44:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:44:47 INFO - 'NO_EM_RESTART': '1', 09:44:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:44:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:44:47 INFO - 'PWD': '/builds/slave/test', 09:44:47 INFO - 'SHELL': '/bin/bash', 09:44:47 INFO - 'SHLVL': '1', 09:44:47 INFO - 'TERM': 'linux', 09:44:47 INFO - 'TMOUT': '86400', 09:44:47 INFO - 'USER': 'cltbld', 09:44:47 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:44:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:44:47 INFO - '_': '/tools/buildbot/bin/python'} 09:44:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:44:47 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 09:44:47 INFO - Cleaning up... 09:44:47 INFO - Return code: 0 09:44:47 INFO - Running post-action listener: _resource_record_post_action 09:44:47 INFO - Running post-action listener: _start_resource_monitoring 09:44:47 INFO - Starting resource monitoring. 09:44:47 INFO - [mozharness: 2017-02-01 17:44:47.309288Z] Finished create-virtualenv step (success) 09:44:47 INFO - [mozharness: 2017-02-01 17:44:47.309866Z] Running install step. 09:44:47 INFO - Running pre-action listener: _resource_record_pre_action 09:44:47 INFO - Running main action method: install 09:44:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:44:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:44:47 INFO - Reading from file tmpfile_stdout 09:44:47 INFO - Detecting whether we're running mozinstall >=1.0... 09:44:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:44:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:44:47 INFO - Reading from file tmpfile_stdout 09:44:47 INFO - Output received: 09:44:47 INFO - Usage: mozinstall [options] installer 09:44:47 INFO - Options: 09:44:47 INFO - -h, --help show this help message and exit 09:44:47 INFO - -d DEST, --destination=DEST 09:44:47 INFO - Directory to install application into. [default: 09:44:47 INFO - "/builds/slave/test"] 09:44:47 INFO - --app=APP Application being installed. [default: firefox] 09:44:47 INFO - mkdir: /builds/slave/test/build/application 09:44:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 09:44:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 09:45:01 INFO - Reading from file tmpfile_stdout 09:45:01 INFO - Output received: 09:45:01 INFO - /builds/slave/test/build/application/firefox/firefox 09:45:01 INFO - Running post-action listener: _resource_record_post_action 09:45:02 INFO - [mozharness: 2017-02-01 17:45:02.000372Z] Finished install step (success) 09:45:02 INFO - [mozharness: 2017-02-01 17:45:02.000623Z] Running run-tests step. 09:45:02 INFO - Running pre-action listener: _resource_record_pre_action 09:45:02 INFO - Running main action method: run_tests 09:45:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:45:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:45:02 INFO - Python 2.7.3 09:45:02 INFO - Return code: 0 09:45:02 INFO - grabbing minidump binary from tooltool 09:45:02 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')]} 09:45:02 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 0x1700f60>, '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 0x1701d40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17021d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:45:02 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 09:45:02 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 09:45:02 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 09:45:02 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:45:02 INFO - Return code: 0 09:45:02 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 09:45:02 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:45:02 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:45:02 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 09:45:02 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:45:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--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 09:45:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Beta --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-062 --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 09:45:02 INFO - Using env: {'DISPLAY': ':0', 09:45:02 INFO - 'HOME': '/home/cltbld', 09:45:02 INFO - 'LANG': 'en_US.UTF-8', 09:45:02 INFO - 'LANGUAGE': 'en_US:en', 09:45:02 INFO - 'LOGNAME': 'cltbld', 09:45:02 INFO - 'MAIL': '/var/mail/cltbld', 09:45:02 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:45:02 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 09:45:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:45:02 INFO - 'MOZ_NO_REMOTE': '1', 09:45:02 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:45:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:45:02 INFO - 'NO_EM_RESTART': '1', 09:45:02 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:45:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:45:02 INFO - 'PWD': '/builds/slave/test', 09:45:02 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:45:02 INFO - 'SHELL': '/bin/bash', 09:45:02 INFO - 'SHLVL': '1', 09:45:02 INFO - 'TERM': 'linux', 09:45:02 INFO - 'TMOUT': '86400', 09:45:02 INFO - 'USER': 'cltbld', 09:45:02 INFO - 'XDG_SESSION_COOKIE': 'a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219', 09:45:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:45:02 INFO - '_': '/tools/buildbot/bin/python'} 09:45:02 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Beta', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-062', '--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 09:45:02 INFO - mozversion application_buildid: 20170201074109 09:45:02 INFO - mozversion application_changeset: 44777332a82750e2440b88f61a8db6b463377665 09:45:02 INFO - mozversion application_display_name: Firefox 09:45:02 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:45:02 INFO - mozversion application_name: Firefox 09:45:02 INFO - mozversion application_remotingname: firefox 09:45:02 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-beta 09:45:02 INFO - mozversion application_vendor: Mozilla 09:45:02 INFO - mozversion application_version: 52.0 09:45:02 INFO - mozversion platform_buildid: 20170201074109 09:45:02 INFO - mozversion platform_changeset: 44777332a82750e2440b88f61a8db6b463377665 09:45:02 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-beta 09:45:02 INFO - mozversion platform_version: 52.0 09:45:02 INFO - using testdate: 1485971102 09:45:02 INFO - actual date: 1485971102 09:45:02 INFO - starting webserver on 'localhost:51258' 09:45:02 INFO - SUITE-START | Running 2 tests 09:45:02 INFO - TEST-START | dromaeo_css 09:45:02 INFO - operating with platform_type : linux_ 09:45:02 INFO - Initialising browser for dromaeo_css test... 09:45:02 INFO - TEST-INFO | started process 1765 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpck3GXD/profile http://localhost:51258/getInfo.html) 09:45:06 INFO - PROCESS | 1765 | __metrics Screen width/height:1600/1200 09:45:06 INFO - PROCESS | 1765 | colorDepth:24 09:45:06 INFO - PROCESS | 1765 | Browser inner width/height: 1024/697 09:45:06 INFO - PROCESS | 1765 | __metrics 09:45:06 ERROR - PROCESS | 1765 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3197: TypeError: this.tabs is undefined 09:45:07 INFO - TEST-INFO | 1765: exit 0 09:45:07 INFO - Browser initialized. 09:45:07 INFO - Running cycle 1/1 for dromaeo_css test... 09:45:07 INFO - TEST-INFO | started process 1895 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpck3GXD/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:45:19 INFO - PROCESS | 1895 | RSS: Main: 148054016 09:45:19 INFO - PROCESS | 1895 | 09:48:18 INFO - PROCESS | 1895 | Cycle 1(1): loaded http://localhost:51258/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51258/tests/dromaeo/cssquery-ext.html) 09:48:20 INFO - PROCESS | 1895 | RSS: Main: 154456064 09:48:20 INFO - PROCESS | 1895 | 09:51:22 INFO - PROCESS | 1895 | Cycle 1(1): loaded http://localhost:51258/tests/dromaeo/cssquery-ext.html (next: http://localhost:51258/tests/dromaeo/cssquery-jquery.html) 09:51:22 INFO - PROCESS | 1895 | RSS: Main: 152051712 09:51:22 INFO - PROCESS | 1895 | 09:54:24 INFO - PROCESS | 1895 | Cycle 1(1): loaded http://localhost:51258/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51258/tests/dromaeo/cssquery-mootools.html) 09:54:25 INFO - PROCESS | 1895 | RSS: Main: 151199744 09:54:25 INFO - PROCESS | 1895 | 09:57:26 INFO - PROCESS | 1895 | Cycle 1(1): loaded http://localhost:51258/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51258/tests/dromaeo/cssquery-prototype.html) 09:57:27 INFO - PROCESS | 1895 | RSS: Main: 153702400 09:57:27 INFO - PROCESS | 1895 | 10:00:29 INFO - PROCESS | 1895 | Cycle 1(1): loaded http://localhost:51258/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51258/tests/dromaeo/cssquery-yui.html) 10:00:30 INFO - PROCESS | 1895 | RSS: Main: 154988544 10:00:30 INFO - PROCESS | 1895 | 10:03:32 INFO - PROCESS | 1895 | Cycle 1(1): loaded http://localhost:51258/tests/dromaeo/cssquery-yui.html (next: http://localhost:51258/tests/dromaeo/cssquery-dojo.html) 10:03:32 INFO - PROCESS | 1895 | RSS: Main: 155258880 10:03:32 INFO - PROCESS | 1895 | 10:03:32 INFO - PROCESS | 1895 | __start_tp_report 10:03:32 INFO - PROCESS | 1895 | _x_x_mozilla_page_load 10:03:32 INFO - PROCESS | 1895 | _x_x_mozilla_page_load_details 10:03:32 INFO - PROCESS | 1895 | |i|pagename|runs| 10:03:32 INFO - PROCESS | 1895 | |0;dojo.html;3262.265990152216;3281.34373125375;3299.208190034391;3300.861202885004;3304.8678052877885;5636.3799982002;5704.030314846475;5711.685857277853;5725.57058220633;5752.769889204432;5771.624844385112;5784.929787989215;5792;5807.41925807419;5845.269341332333;5199.298094757207;5228.764705588258;5244.056069907415;5263.842084737464;5289.338832645919;5288.576913846883;5289.735513224343;5292.285541451913;5296.682199068049;5328.254044433782;5112.948870511303;5134.768935397916;5261.447548007462;5281.419043905167;5290.576753859701;5169.017886601552;5194.065068287726;5251.684898906078;5300.337457817773;5369.328833895763;5180;5266.315379000705;5280.656757310762;5303;5317.388500322474;5473.863153421156;5666.121751128581;5700.144978253254;5739.569532285053;5813.186153938452;5937.792177273818;6026.276846778371;6110.327863934964;6111.663858487781;6136.509079273647;6132.368817755296;6149.846253843645;6158.261008678943;6254.343293954114;6260.5304602154565;5817.389174136697;5820.330661973885;5825.359210486843;5841.85395365115;5843.649381037151;6174.104754810617;6219.564630475823;6273.278572964167;6330.556861019684;6336.651484168323;6039.7282122304605;6067.059605761114;6073.726682299307;6113.816585502442;6129.172561704202;5952.345242023374;6112.245406105256;6129.664444256096;6136.274005701014;6191.845203869849;5918.733656985446;6089.969550152309;6116.663583502861;6139.2325959255095;6199;6169.352218017133;6187.288461826857;6204.348543402968;6206.348333425016;6243.032329988859;4613.0543238636;4729.408823897013;4739.905201896012;4746.098241334135;4778.474367819537;4157.043879907638;4193.874183774492;4202.075543380452;4248.660107191417;4282.528921818597;5875.20684707559;5891.49922256613;5908.084246941731;5943.375945525744;5971.671558064261;6249.0938813871735;6261.060840873905;6265;6268;6285.120083188357;5710.8001219957105;5804.622699524517;5837.737301821428;5861.824145275648;5863.061910094364;5310.548603368679;5319.042572337016;5327.280817089643;5344.599155063386;5345.812896548602;6375.649339286384;6385.840353991188;6390.041493775971;6392.968035159794;6402.519811014193;6032.276126864629;6035.336113027475;6084.3915608440575;6106.267247930276;6155.446009859134;6361.650109244036;6372.522060845363;6376;6392.073149393219;6393.712282947372;6040.728167232397;6071.301800293023;6081.483073938764;6086.360932102242;6095.908561371494;6024.87950240984;6089.69551522431;6128.050152226412;6209.503239740719;6215.689215539295;5950.404959504015;5985.521158307412;5988.6107403020405;6012.3386427493815;6019.127226552213;5923.289205295392;6011.218541589566;6055.666938318434;6060.848478788065;6063.484603808725;5759.337676167294;5870.913880932041;6040.939590604038;6044.576879618385;6074.483668888194;5915.70421478933;5937.851553711192;5972.970135149297;6009.819705408845;6044;5902.734376952962;5920.526357891445;5923.46688797993;5927.644341339534;5935.495482884004 10:03:32 INFO - PROCESS | 1895 | |1;ext.html;582.2837909371473;621.2296752027486;636.4494712074056;662.8873091574432;680.669875110571;43324.566754332445;44490.555094449046;45110.77444612776;49041;49173;45800.312995305096;45877;46304.53695463044;46602.30096548546;46668;8867.29061675066;9008.279337653004;9024;9047.050059743731;9060.818783624323;8911.153440423182;8927;8950.910490895105;8979.685711000084;9020.503872287021;9086.681966131187;9118.17936385725;9132.132447417485;9141.451512909214;9189.540522973857;9013.233875120623;9030.593623286935;9057.275417966546;9063.365564410495;9101.317401194938;8951.149640784115;9006.234470070052;9010.27917766577;9034.638614455414;9049.683261085831;43340;43734.781326093485;44005.55994440047;44096.779516102215;44115.55884441147;3473.096994781375;3592.8742494012845;3621.7102631789394;3716.535433070866;3939.5666476687543;32479;32809.50785738216;33159.668403315896;33185.87388468166;33582.83208583966;4213.936790948138;4380.080183161508;4420.270655341897;4452.732836029816;4485.573870482299;368973;378388;379236;379943;382389.0880545607;64788.352116479175;65556.67221663862;65731.67134164298;65763.34236657667;65831.67084164548;70191.29808701847;70963;71072.64463677649;71120;71229.6438517804;17905.820941790415;17998.91000544989;18023.72964405535;18027.459176224733;18153.273869045355;13611.795823062663;13724.588262352145;13778.65553361174;13783.793243101361;13785;19698.901505492668;20518;20684.965751712356;20739.170433182502;20838.895805520875;3597.406427939413;3648.2703459308245;7453.403727701771;7593.368045492245;7703.383729301642;935.1770442011123;1005.4922264256504;1072.7747173093737;1103.900648941599;1124.1793490751797;31553;31602.683973159976;32258;32272.60236328643;32298.192545186557;1055.6621880998007;1180.362604193743;1181.3915833345834;1184.9526018959318;1218.9695257618453;16756.32974680999;17167.31330746781;17288.308467661154;17316.39392621252;17319.65360692779;507528.08595526865;511189;513583;516423;516967;61623;62241;62277;62384.376156238766;62582.37417625856;1376.0367742580233;1385.6605131742788;1387.6253411578816;1429.9285035748171;1456.8834493240515;30824.537631935986;31317.53023704601;31785.36429271448;32303.35393292074;32508.02475925726;53862.730686346316;54250.72874635601;54283;54307.55615997368;54334.45665543294;420982;421834;423456;424318.878405606;427147;29937.85031074831;30150.69849301479;30541.236469087562;30558.08325750231;30630.540541892336;47573.28640070471;48088.75955620199;48471.75764121157;48774;49578.75210623924;41975.160496789285;42313.78843105888;42737.786311068245;42756;44219.77890110529;41288.587114129674;41509.58490415057;42299.57700423079;43030.35454468123;43692.34461483144;41303.38044929389;41768.791156044026;42805.78597106995;43077.784611078;43154.78422607992;34746;37347.25305493929;37585;37756.811215943744;38080.42879356757;28489.28776780597;28670.85664571747;28720;28835;28846.423071538873 10:03:32 INFO - PROCESS | 1895 | |2;jquery.html;422.2273239970852;424.13264873334026;427.60019381877964;432.16591977483466;450.4616982705666;18911.24355025799;19578.804211957893;20550.280740174097;20663.58672826546;20687.275945341917;16042.117683527402;18498.167582458787;19121.904390478026;19450.221991120372;19644.410667679993;5760.56795740319;5944.108383742451;6022.126791615235;6030.9396906030815;6043.3956604339655;5742.54059675225;5833.708314584275;5884.235049443566;5951.85120371992;5954.523638108941;5801.245838041049;5843.737031833578;5849.619774714652;5854.268216472941;5855.824325270228;5670.716464176816;5846.2107615472005;5861.472467477926;5864.413558644144;5922.970385148046;5305.973470132624;5314.893702125974;5343.492368225013;5357.973210133924;5368.463153684639;23002.30993070194;23288.767112329;23557.411064723346;23640.763592364026;23669;2426.381272775431;2564.3204550794053;2603.4662894106664;2867.913962581126;2894.2619631993916;13933;14790.334434950453;14798.556043318718;15016.24918754058;15316.081035137817;1959.7648282206085;2055.43475544225;2067.9483012924647;2077.5637116205617;2105.768365479796;80175.5991220046;80339;80778;81561;82680.58659706663;10830.566777328977;10981.39602321864;11019.173561982723;11109.555617775199;11299.723080306783;15708.921455392878;15715.528534143994;15728.213589320489;15770.211489425483;15846.128462934419;8528.488290702579;8565.400421970402;8739.51932643698;8818.735437936872;8877.701192711937;8580.399372044021;8582.442141260799;8716.21554060125;8901.154390332907;9028.8645670315;6811.386975172259;6935.514513983972;6937.895931561031;7064.258252883476;7085.645717714094;2032.9593408131755;2083.2812679625504;2096.465401322653;2096.695979083055;2103.116690989788;940.5579377692474;982.6757170133839;995.1392045880261;996.7508122969258;1002.6340385759146;19405.611887762167;19460;19514.31699890497;19634.70547941782;19818.405447836587;991.5339790298548;1026.8716410448694;1027.5838285494387;1071.989280107189;1082.631905152252;10785.298955567863;11018.50416731249;11155.107591392669;11234.775304493864;11257.774844503065;412899;418505;420059.7994020082;427643;428723;68455;76919.23080769232;77377.6131119352;79623.20376796274;82255.58872205601;1008.5108722269694;1018.2108865629049;1070.3845288958723;1070.8661417322835;1074.0387353318736;17450.563735906195;17527.649447011245;18000.63998719992;18180.72728909041;18390.908045459688;43951.560484394744;44805;44875.551244487135;44936.55063449324;45498.772506137255;61314.38685613087;61975.38024619696;62432.375676244475;63028;63608.68195658992;8808.603612837309;9031.232345250728;9090.59092340833;9184.219341355792;9264.305177111608;12703.42834572465;13371.331433428095;13489.797653035408;13661.590152295446;13758.449662013407;11836.408179590813;11946.701332466759;12246.816297755719;12344.259344439362;12468.937655311665;11624.128190385924;11687.357195353998;12018.158728888893;12062.45718942632;12312.75374492523;11200.495977680861;11333.376664283214;11831.822522661994;11961.581344652895;12248.265104093784;8657.09100544459;8953.149450802164;8963.282937364866;9123.406978546373;9204.171624553823;10609.098226650822;11543.36511491876;11756.059515238589;11903.245706552883;11942.104342174545 10:03:32 INFO - PROCESS | 1895 | |3;mootools.html;1495.3719437836112;1508.8491150884909;1673.5230459319089;1776.671315806575;1801.2524802207076;7434.814129646761;7661.731839385623;8150.510969341836;8406.11735767744;8443.957780211098;8003.279704826565;8297.668093276277;8317.168283171679;8396.1603839616;8524.360672949522;2386.451116243265;2419.0565679384968;2421.7336093029753;2422.430728778744;2423.4910668759494;2412.2401443545314;2419.9516009679796;2448.461338505535;2451.4974430241846;2466.580681284186;2397.8561286322874;2414.28778510339;2434.257551446808;2448.485817978227;2451.521953219123;2317.2468947592015;2334.3580515358244;2337.0651739304244;2341.1805867946255;2356.552255071531;2348.5302939412186;2359.634256690216;2360.7639236076425;2375.904963801446;2382.1781485387514;8353.582320883932;8475.279601233902;8498.532580708059;8520.829583408358;8528.403011789178;5142.665726727788;5171.689698618095;5303.36359636846;5305.124654432014;5313.7608807603365;3219.2434777827193;3225.0808519572042;3260.8858689945737;3294.8352582370785;3311.4867195584725;1036.3574583758043;1041.8385150301715;1056.5932116135266;1086.6359769477235;1097.253867370188;11496.712582185428;11548.53805847765;11615.883841161565;11624.186306958516;11658.06735461161;4277.337012763027;4530.252508336088;4559.954400456019;4580.1755683976535;4587.839425620087;9209.35534512591;9216.493092879822;9226.123518265755;9231.446113233227;9263.953680231556;5153.17549192135;5161.27742116104;5163.612729045337;5165.1219292720325;5179.456157103526;4656.138614356355;4788.856334309976;4860.076585448754;4910;4924.704517728947;3771.30230907283;3868.458415821787;3902.297586434412;3916.1580260244186;3977.801109944491;1195.7488927325185;1196.3180986837592;1204.560335477562;1214.6416807041944;1219.71336735867;957.5164541906292;981.7349315684725;982.2878413150409;1000.4847503535685;1009.9343542669703;5567.972160139255;5630.577706672016;5828.300603927556;5875.265591801025;5907.793227237026;460.63149480415535;463.04150408653766;468.32794939262266;469.83555755485304;472.06531068484594;4050.0482386639114;4148.481439820022;4158.750474971512;4178.1643671265865;4183.477065366829;9993.800123997626;10307.123894468905;10377.377357358582;10393.06462418386;10450.268481206243;10255.641052563275;10301;10308.587656493657;10318.845217321747;10319.74200644975;7576.356009739124;7797.376209903194;7834.921650783534;7884.526928384315;7886.211378862183;5709.857253568694;5721.57088218377;5793.04414771558;5996.37038110992;6098.451139397475;9497.620095196115;9596.9040309596;9654.75863103428;9660.130588247092;9674.08096230857;9330.440173589606;9529.142377186086;9599.952000239955;9637.566309516229;9714.514274286115;7228.4578656599915;7295.671694773641;7403.7408690695565;7493;7703.383729301754;8291.751247462586;8345.207205315486;8404.663813447394;8414.6213420395;8432.83134337322;7209.819754506179;7236.4210863131875;7261.237570055279;7264.963675181802;7361.926380736339;7327.120745510573;7401.1488678802625;7403.481756277009;7418.109826820816;7488.213737557696;6691.063251144747;6804.727810887509;6808.863822723617;6812.420944219599;6825;4926.285688575208;4944.456109827988;4946.233333833262;4958.528939750718;5117.411497677815;4953.578945789504;5003.724795136302;5016.448190699093;5065.949340506695;5176.559992400688 10:03:32 INFO - PROCESS | 1895 | |4;prototype.html;353.1471496336348;360.45211278856135;364.89965259553634;365.52328592486356;368.69398399328554;5478.822053258548;5592.384837667853;5601.80393686221;5694.487496125343;5709.571782116343;5427.43011983742;5554.555635549156;5592.734942348346;5594.916076258859;5617;4414.955850441486;4417.867463976086;4421.182081314951;4441.977790111045;4449.688521803475;4102;4321.308590625501;4362.8036738346855;4396.582324679151;4397.582229688191;4264.637505811994;4298.763568003758;4317.309230523117;4322.675799315049;4333.198358303708;4296.5273819879785;4300.892477688051;4307.375430562583;4317.740935543878;4331.45856767904;3693.9445908311395;3787.867424640124;3793.2792769374005;3799.7910114943666;3809.5618803965485;5417.620766546304;5442.156465747816;5445.891082178374;5456.454354564551;5460.153676180198;4993.525615066599;5000;5000.224965130375;5011.774470148852;5037.093323201822;5576.6375185613215;5838.241028666289;5856.502197313233;5857.853553661193;5883.17635531026;4254.340577210537;4258.360531195481;4262.232798096342;4266.701330906838;4274.764887931163;6069.0592958091565;6085.300190478108;6152.72312745923;6157.599756015889;6175.5985860919345;4225.640820530228;4306.978465107717;4363.38912552243;4365.978170109129;4410.823567057346;4385.298352263686;4385.342198670161;4409.889752756207;4411;4421.7789110544345;4973.2042873140845;4987.326710893983;4999.3000979862845;5004.974975125101;5013.849584512471;5741.368449470555;5863.768608592158;5879.52963762898;5909.556783241188;5938.18885240006;1467.222372142766;1478.571214347827;1478.9942838869456;1480.3782411387244;1488.947886823956;962.5427921737119;1000.1148983149819;1006.2101250518308;1008.7931973945324;1020.6529779874878;5528.281323428009;5541.5843811714285;5542.528885044816;5550.777968881281;5569.303837020372;5774.018416869142;5786.392428795;5813.215215945877;5834.970825145847;5878.911816322759;5332.30680011596;5458.972705136528;5482.945170548323;5493.560515158778;5524.138757893109;3101.72084512395;3102.612173478315;3128.9843550782102;3132.7180553750272;3136.2473006478735;5784.566157538117;5926.2295901532525;6013.857367100237;6075.27096748393;6077.8480537986015;5822.651975114241;5955.34491205967;5960.493358064527;5971.7611295547695;6007.609505382136;5992.43071908168;6018.8194354169445;6022.584692597236;6028.125921741323;6039.691972713066;5658.152456329571;5750.769969201352;5863.768608592243;5871.970640146772;5902.911456328073;5774.220480235283;5777.480026797609;5786.842631473806;5791.7683292667825;5831.446012628793;5951.732172052181;6033.637981721111;6036.158971513731;6046;6195.659238741912;4311.913761724811;4409.206342858316;4423.871912662251;4443.289073748185;4451.3323001550025;6002;6016.789412370546;6022.789202377896;6031.939680603314;6061.484773794277;5660.698039450867;5817.5345972321265;5844.211031510862;5851.268591426072;5931;5904.3210030847;5915.615484993462;5916;5931.7627294907725;5943.791967281298;5874.676892770939;5896.761680047067;5914.645121292564;5927.170196172626;5937.2578427696535;5692.51613612831;5920.467157955804;5956.987312156857;5967.9701601491715;5986.850328741816;5859.798741258117;5862.534366408398;5869;5873.676947767743;5874.412558744091 10:03:32 INFO - PROCESS | 1895 | |5;yui.html;753.7350262461302;763.076677220563;829.2826704900261;850.7617866997235;869.6260607938586;14801.851981480182;15536.378544858206;16218.351265949363;16233.107179105144;16254;14418.279086045708;14581.270936453187;14612.977091603592;14668.413263469474;14734.705305893876;819.7868554175913;831.846108469935;832.9791755206107;834.015861283685;835.4319063037133;807.1363640904235;808.0182578167526;809.7854068671807;809.9068607110199;811.9797005074861;860.6514361683497;871.3247233394106;871.525018864717;871.790770215147;874.7200895713374;856.648774002659;858.0132847225678;859.660434128522;861.5821326656567;864.1660797330607;640.3628389752226;640.3980258556942;642.7332656947361;643.1060825452624;643.2731013954249;13241.668958276025;13247.138935969131;13271.800922986164;13281.136726112773;13340.466381344735;12008.939955300168;12026.338551379671;12314.630561083091;12588.4335204916;12608.936955315165;10722.249442539025;10799;10850.131989440904;10989.450527473675;11026.944865275622;3756.398976163828;3766.642168993941;3798.601146879593;3832.9616703832885;3924.607539246081;61095.389046109856;62480.37519624791;62844.685776571736;62893.056604150974;63671;8662.220400164015;8691.261242794433;8714.433561818461;8746.431481953652;8863.379563430499;18019.72970405445;18127.09364531768;18138.455846324632;18170.727439088423;18199.272029118685;7459.701611935462;7822.647980840876;7846.411519136088;8416.957915210507;8481.491110533389;4666.533346665306;4842.854714358575;4957.3059771632;5064.341635587423;5068.315777370081;3397.8810741623925;3480.8781692640637;3485.9477107843404;3505.789652620851;3510.7015903647966;610.1640752169468;621.4748537485817;621.7295476467751;643.3727116061802;654.3554598720257;652.3867564489365;672.9831754206086;691.68182635987;700.1073631120261;714.6426786606696;9045.095490451034;9067.648962118466;9274.67538636158;9297.16325530692;9400.717978460658;597.7788218359235;622.5113286070413;633.5786701843315;670.6143967218869;674.5750177388214;4449.243628583149;4488.506264310923;4508.098380323949;4532.478764942008;4535.841245556389;92433.53783231041;92693.53653231691;92797.53601231951;93706;94546;47432.28851567229;49042;51041.48958510367;63237.68381158157;73832.63083684654;66212.66893665501;66453;68105;68260.6586967062;70426;9026.81946361056;9118.772030699285;9156.771080723036;9193.172614464731;9217.907820921973;43583;46402.6079217624;46597.53402465932;47580.76209619068;47939.76030119827;39316;42610.36084458797;42833.78583107064;57553.71223143858;62617;11045.226834121855;11160.44197790091;11166.888331116585;11202.327860328407;11349;13010.544630937871;13022.4139913706;13101.475940962255;13118.409671564994;13328.866711332763;11995.940020299842;12007.339596322287;12062.466881954888;12253.448594813077;12660.936695316464;11806.822897656713;12008.279503229835;12093.09301802386;12411.875881241072;12653.240805551697;11507.194496385173;11721.882781172078;11793.29240245588;11988.580399686318;12028.037756979245;9206.447613143233;9327;9519.714408567754;9593.811991265735;9713.27150463704;10253.743656408351;10334.586616535255;10358.430286334324;10386.844197337197;10436.478176091014 10:03:32 INFO - PROCESS | 1895 | __end_tp_report 10:03:32 INFO - PROCESS | 1895 | __start_cc_report 10:03:32 INFO - PROCESS | 1895 | _x_x_mozilla_cycle_collect,306 10:03:32 INFO - PROCESS | 1895 | __end_cc_report 10:03:32 INFO - PROCESS | 1895 | __startTimestamp1485972212975__endTimestamp 10:03:32 INFO - PROCESS | 1895 | 10:03:32 INFO - PROCESS | 1895 | ------- Summary: start ------- 10:03:32 INFO - PROCESS | 1895 | Number of tests: 6 10:03:32 INFO - PROCESS | 1895 | 10:03:32 INFO - PROCESS | 1895 | [#0] dojo.html Cycles:165 Average:5721.05 Median:5935.50 stddev:648.29 (10.9%) stddev-sans-first:620.92 10:03:32 INFO - PROCESS | 1895 | Values: 3262.3 3281.3 3299.2 3300.9 3304.9 5636.4 5704.0 5711.7 5725.6 5752.8 5771.6 5784.9 5792.0 5807.4 5845.3 5199.3 5228.8 5244.1 5263.8 5289.3 5288.6 5289.7 5292.3 5296.7 5328.3 5112.9 5134.8 5261.4 5281.4 5290.6 5169.0 5194.1 5251.7 5300.3 5369.3 5180.0 5266.3 5280.7 5303.0 5317.4 5473.9 5666.1 5700.1 5739.6 5813.2 5937.8 6026.3 6110.3 6111.7 6136.5 6132.4 6149.8 6158.3 6254.3 6260.5 5817.4 5820.3 5825.4 5841.9 5843.6 6174.1 6219.6 6273.3 6330.6 6336.7 6039.7 6067.1 6073.7 6113.8 6129.2 5952.3 6112.2 6129.7 6136.3 6191.8 5918.7 6090.0 6116.7 6139.2 6199.0 6169.4 6187.3 6204.3 6206.3 6243.0 4613.1 4729.4 4739.9 4746.1 4778.5 4157.0 4193.9 4202.1 4248.7 4282.5 5875.2 5891.5 5908.1 5943.4 5971.7 6249.1 6261.1 6265.0 6268.0 6285.1 5710.8 5804.6 5837.7 5861.8 5863.1 5310.5 5319.0 5327.3 5344.6 5345.8 6375.6 6385.8 6390.0 6393.0 6402.5 6032.3 6035.3 6084.4 6106.3 6155.4 6361.7 6372.5 6376.0 6392.1 6393.7 6040.7 6071.3 6081.5 6086.4 6095.9 6024.9 6089.7 6128.1 6209.5 6215.7 5950.4 5985.5 5988.6 6012.3 6019.1 5923.3 6011.2 6055.7 6060.8 6063.5 5759.3 5870.9 6040.9 6044.6 6074.5 5915.7 5937.9 5973.0 6009.8 6044.0 5902.7 5920.5 5923.5 5927.6 5935.5 10:03:32 INFO - PROCESS | 1895 | 10:03:32 INFO - PROCESS | 1895 | [#1] ext.html Cycles:180 Average:61267.61 Median:42780.89 stddev:116802.43 (273.0%) stddev-sans-first:117041.22 10:03:32 INFO - PROCESS | 1895 | Values: 582.3 621.2 636.4 662.9 680.7 43324.6 44490.6 45110.8 49041.0 49173.0 45800.3 45877.0 46304.5 46602.3 46668.0 8867.3 9008.3 9024.0 9047.1 9060.8 8911.2 8927.0 8950.9 8979.7 9020.5 9086.7 9118.2 9132.1 9141.5 9189.5 9013.2 9030.6 9057.3 9063.4 9101.3 8951.1 9006.2 9010.3 9034.6 9049.7 43340.0 43734.8 44005.6 44096.8 44115.6 3473.1 3592.9 3621.7 3716.5 3939.6 32479.0 32809.5 33159.7 33185.9 33582.8 4213.9 4380.1 4420.3 4452.7 4485.6 368973.0 378388.0 379236.0 379943.0 382389.1 64788.4 65556.7 65731.7 65763.3 65831.7 70191.3 70963.0 71072.6 71120.0 71229.6 17905.8 17998.9 18023.7 18027.5 18153.3 13611.8 13724.6 13778.7 13783.8 13785.0 19698.9 20518.0 20685.0 20739.2 20838.9 3597.4 3648.3 7453.4 7593.4 7703.4 935.2 1005.5 1072.8 1103.9 1124.2 31553.0 31602.7 32258.0 32272.6 32298.2 1055.7 1180.4 1181.4 1185.0 1219.0 16756.3 17167.3 17288.3 17316.4 17319.7 507528.1 511189.0 513583.0 516423.0 516967.0 61623.0 62241.0 62277.0 62384.4 62582.4 1376.0 1385.7 1387.6 1429.9 1456.9 30824.5 31317.5 31785.4 32303.4 32508.0 53862.7 54250.7 54283.0 54307.6 54334.5 420982.0 421834.0 423456.0 424318.9 427147.0 29937.9 30150.7 30541.2 30558.1 30630.5 47573.3 48088.8 48471.8 48774.0 49578.8 41975.2 42313.8 42737.8 42756.0 44219.8 41288.6 41509.6 42299.6 43030.4 43692.3 41303.4 41768.8 42805.8 43077.8 43154.8 34746.0 37347.3 37585.0 37756.8 38080.4 28489.3 28670.9 28720.0 28835.0 28846.4 10:03:32 INFO - PROCESS | 1895 | 10:03:32 INFO - PROCESS | 1895 | [#2] jquery.html Cycles:180 Average:27264.02 Median:2495.35 stddev:69601.58 (2789.3%) stddev-sans-first:69767.65 10:03:32 INFO - PROCESS | 1895 | Values: 422.2 424.1 427.6 432.2 450.5 18911.2 19578.8 20550.3 20663.6 20687.3 16042.1 18498.2 19121.9 19450.2 19644.4 5760.6 5944.1 6022.1 6030.9 6043.4 5742.5 5833.7 5884.2 5951.9 5954.5 5801.2 5843.7 5849.6 5854.3 5855.8 5670.7 5846.2 5861.5 5864.4 5923.0 5306.0 5314.9 5343.5 5358.0 5368.5 23002.3 23288.8 23557.4 23640.8 23669.0 2426.4 2564.3 2603.5 2867.9 2894.3 13933.0 14790.3 14798.6 15016.2 15316.1 1959.8 2055.4 2067.9 2077.6 2105.8 80175.6 80339.0 80778.0 81561.0 82680.6 10830.6 10981.4 11019.2 11109.6 11299.7 15708.9 15715.5 15728.2 15770.2 15846.1 8528.5 8565.4 8739.5 8818.7 8877.7 8580.4 8582.4 8716.2 8901.2 9028.9 6811.4 6935.5 6937.9 7064.3 7085.6 2033.0 2083.3 2096.5 2096.7 2103.1 940.6 982.7 995.1 996.8 1002.6 19405.6 19460.0 19514.3 19634.7 19818.4 991.5 1026.9 1027.6 1072.0 1082.6 10785.3 11018.5 11155.1 11234.8 11257.8 412899.0 418505.0 420059.8 427643.0 428723.0 68455.0 76919.2 77377.6 79623.2 82255.6 1008.5 1018.2 1070.4 1070.9 1074.0 17450.6 17527.6 18000.6 18180.7 18390.9 43951.6 44805.0 44875.6 44936.6 45498.8 61314.4 61975.4 62432.4 63028.0 63608.7 8808.6 9031.2 9090.6 9184.2 9264.3 12703.4 13371.3 13489.8 13661.6 13758.4 11836.4 11946.7 12246.8 12344.3 12468.9 11624.1 11687.4 12018.2 12062.5 12312.8 11200.5 11333.4 11831.8 11961.6 12248.3 8657.1 8953.1 8963.3 9123.4 9204.2 10609.1 11543.4 11756.1 11903.2 11942.1 10:03:32 INFO - PROCESS | 1895 | 10:03:32 INFO - PROCESS | 1895 | [#3] mootools.html Cycles:180 Average:5569.85 Median:4981.13 stddev:3073.03 (61.7%) stddev-sans-first:3066.40 10:03:32 INFO - PROCESS | 1895 | Values: 1495.4 1508.8 1673.5 1776.7 1801.3 7434.8 7661.7 8150.5 8406.1 8444.0 8003.3 8297.7 8317.2 8396.2 8524.4 2386.5 2419.1 2421.7 2422.4 2423.5 2412.2 2420.0 2448.5 2451.5 2466.6 2397.9 2414.3 2434.3 2448.5 2451.5 2317.2 2334.4 2337.1 2341.2 2356.6 2348.5 2359.6 2360.8 2375.9 2382.2 8353.6 8475.3 8498.5 8520.8 8528.4 5142.7 5171.7 5303.4 5305.1 5313.8 3219.2 3225.1 3260.9 3294.8 3311.5 1036.4 1041.8 1056.6 1086.6 1097.3 11496.7 11548.5 11615.9 11624.2 11658.1 4277.3 4530.3 4560.0 4580.2 4587.8 9209.4 9216.5 9226.1 9231.4 9264.0 5153.2 5161.3 5163.6 5165.1 5179.5 4656.1 4788.9 4860.1 4910.0 4924.7 3771.3 3868.5 3902.3 3916.2 3977.8 1195.7 1196.3 1204.6 1214.6 1219.7 957.5 981.7 982.3 1000.5 1009.9 5568.0 5630.6 5828.3 5875.3 5907.8 460.6 463.0 468.3 469.8 472.1 4050.0 4148.5 4158.8 4178.2 4183.5 9993.8 10307.1 10377.4 10393.1 10450.3 10255.6 10301.0 10308.6 10318.8 10319.7 7576.4 7797.4 7834.9 7884.5 7886.2 5709.9 5721.6 5793.0 5996.4 6098.5 9497.6 9596.9 9654.8 9660.1 9674.1 9330.4 9529.1 9600.0 9637.6 9714.5 7228.5 7295.7 7403.7 7493.0 7703.4 8291.8 8345.2 8404.7 8414.6 8432.8 7209.8 7236.4 7261.2 7265.0 7361.9 7327.1 7401.1 7403.5 7418.1 7488.2 6691.1 6804.7 6808.9 6812.4 6825.0 4926.3 4944.5 4946.2 4958.5 5117.4 4953.6 5003.7 5016.4 5065.9 5176.6 10:03:32 INFO - PROCESS | 1895 | 10:03:32 INFO - PROCESS | 1895 | [#4] prototype.html Cycles:180 Average:4911.06 Median:5561.93 stddev:1429.83 (25.7%) stddev-sans-first:1392.32 10:03:32 INFO - PROCESS | 1895 | Values: 353.1 360.5 364.9 365.5 368.7 5478.8 5592.4 5601.8 5694.5 5709.6 5427.4 5554.6 5592.7 5594.9 5617.0 4415.0 4417.9 4421.2 4442.0 4449.7 4102.0 4321.3 4362.8 4396.6 4397.6 4264.6 4298.8 4317.3 4322.7 4333.2 4296.5 4300.9 4307.4 4317.7 4331.5 3693.9 3787.9 3793.3 3799.8 3809.6 5417.6 5442.2 5445.9 5456.5 5460.2 4993.5 5000.0 5000.2 5011.8 5037.1 5576.6 5838.2 5856.5 5857.9 5883.2 4254.3 4258.4 4262.2 4266.7 4274.8 6069.1 6085.3 6152.7 6157.6 6175.6 4225.6 4307.0 4363.4 4366.0 4410.8 4385.3 4385.3 4409.9 4411.0 4421.8 4973.2 4987.3 4999.3 5005.0 5013.8 5741.4 5863.8 5879.5 5909.6 5938.2 1467.2 1478.6 1479.0 1480.4 1488.9 962.5 1000.1 1006.2 1008.8 1020.7 5528.3 5541.6 5542.5 5550.8 5569.3 5774.0 5786.4 5813.2 5835.0 5878.9 5332.3 5459.0 5482.9 5493.6 5524.1 3101.7 3102.6 3129.0 3132.7 3136.2 5784.6 5926.2 6013.9 6075.3 6077.8 5822.7 5955.3 5960.5 5971.8 6007.6 5992.4 6018.8 6022.6 6028.1 6039.7 5658.2 5750.8 5863.8 5872.0 5902.9 5774.2 5777.5 5786.8 5791.8 5831.4 5951.7 6033.6 6036.2 6046.0 6195.7 4311.9 4409.2 4423.9 4443.3 4451.3 6002.0 6016.8 6022.8 6031.9 6061.5 5660.7 5817.5 5844.2 5851.3 5931.0 5904.3 5915.6 5916.0 5931.8 5943.8 5874.7 5896.8 5914.6 5927.2 5937.3 5692.5 5920.5 5957.0 5968.0 5986.9 5859.8 5862.5 5869.0 5873.7 5874.4 10:03:32 INFO - PROCESS | 1895 | 10:03:32 INFO - PROCESS | 1895 | [#5] yui.html Cycles:180 Average:16666.03 Median:54297.60 stddev:22276.28 (41.0%) stddev-sans-first:22306.73 10:03:32 INFO - PROCESS | 1895 | Values: 753.7 763.1 829.3 850.8 869.6 14801.9 15536.4 16218.4 16233.1 16254.0 14418.3 14581.3 14613.0 14668.4 14734.7 819.8 831.8 833.0 834.0 835.4 807.1 808.0 809.8 809.9 812.0 860.7 871.3 871.5 871.8 874.7 856.6 858.0 859.7 861.6 864.2 640.4 640.4 642.7 643.1 643.3 13241.7 13247.1 13271.8 13281.1 13340.5 12008.9 12026.3 12314.6 12588.4 12608.9 10722.2 10799.0 10850.1 10989.5 11026.9 3756.4 3766.6 3798.6 3833.0 3924.6 61095.4 62480.4 62844.7 62893.1 63671.0 8662.2 8691.3 8714.4 8746.4 8863.4 18019.7 18127.1 18138.5 18170.7 18199.3 7459.7 7822.6 7846.4 8417.0 8481.5 4666.5 4842.9 4957.3 5064.3 5068.3 3397.9 3480.9 3485.9 3505.8 3510.7 610.2 621.5 621.7 643.4 654.4 652.4 673.0 691.7 700.1 714.6 9045.1 9067.6 9274.7 9297.2 9400.7 597.8 622.5 633.6 670.6 674.6 4449.2 4488.5 4508.1 4532.5 4535.8 92433.5 92693.5 92797.5 93706.0 94546.0 47432.3 49042.0 51041.5 63237.7 73832.6 66212.7 66453.0 68105.0 68260.7 70426.0 9026.8 9118.8 9156.8 9193.2 9217.9 43583.0 46402.6 46597.5 47580.8 47939.8 39316.0 42610.4 42833.8 57553.7 62617.0 11045.2 11160.4 11166.9 11202.3 11349.0 13010.5 13022.4 13101.5 13118.4 13328.9 11995.9 12007.3 12062.5 12253.4 12660.9 11806.8 12008.3 12093.1 12411.9 12653.2 11507.2 11721.9 11793.3 11988.6 12028.0 9206.4 9327.0 9519.7 9593.8 9713.3 10253.7 10334.6 10358.4 10386.8 10436.5 10:03:32 INFO - PROCESS | 1895 | -------- Summary: end -------- 10:03:32 INFO - PROCESS | 1895 | 10:03:33 INFO - TEST-INFO | 1895: exit 0 10:03:33 INFO - TEST-OK | dromaeo_css | took 1111471ms 10:03:33 INFO - TEST-START | kraken 10:03:33 INFO - operating with platform_type : linux_ 10:03:33 INFO - Initialising browser for kraken test... 10:03:33 INFO - TEST-INFO | started process 2252 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8jik73/profile http://localhost:51258/getInfo.html) 10:03:37 INFO - PROCESS | 2252 | __metrics Screen width/height:1600/1200 10:03:37 INFO - PROCESS | 2252 | colorDepth:24 10:03:37 INFO - PROCESS | 2252 | Browser inner width/height: 1024/697 10:03:37 INFO - PROCESS | 2252 | __metrics 10:03:38 ERROR - PROCESS | 2252 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3197: TypeError: this.tabs is undefined 10:03:38 INFO - TEST-INFO | 2252: exit 0 10:03:38 INFO - Browser initialized. 10:03:38 INFO - Running cycle 1/1 for kraken test... 10:03:38 INFO - TEST-INFO | started process 2455 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8jik73/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:03:50 INFO - PROCESS | 2455 | RSS: Main: 147398656 10:03:50 INFO - PROCESS | 2455 | 10:03:53 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51258/tests/kraken/driver.html?testName=audio-beat-detection) 10:03:54 INFO - PROCESS | 2455 | RSS: Main: 153161728 10:03:54 INFO - PROCESS | 2455 | 10:03:56 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51258/tests/kraken/driver.html?testName=audio-dft) 10:03:57 INFO - PROCESS | 2455 | RSS: Main: 152064000 10:03:57 INFO - PROCESS | 2455 | 10:04:00 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51258/tests/kraken/driver.html?testName=audio-fft) 10:04:00 INFO - PROCESS | 2455 | RSS: Main: 152670208 10:04:00 INFO - PROCESS | 2455 | 10:04:02 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51258/tests/kraken/driver.html?testName=audio-oscillator) 10:04:03 INFO - PROCESS | 2455 | RSS: Main: 152350720 10:04:03 INFO - PROCESS | 2455 | 10:04:05 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51258/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:04:06 INFO - PROCESS | 2455 | RSS: Main: 152137728 10:04:06 INFO - PROCESS | 2455 | 10:04:09 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51258/tests/kraken/driver.html?testName=imaging-darkroom) 10:04:09 INFO - PROCESS | 2455 | RSS: Main: 154898432 10:04:09 INFO - PROCESS | 2455 | 10:04:13 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51258/tests/kraken/driver.html?testName=imaging-desaturate) 10:04:13 INFO - PROCESS | 2455 | RSS: Main: 155226112 10:04:13 INFO - PROCESS | 2455 | 10:04:16 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51258/tests/kraken/driver.html?testName=json-parse-financial) 10:04:17 INFO - PROCESS | 2455 | RSS: Main: 154968064 10:04:17 INFO - PROCESS | 2455 | 10:04:18 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51258/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:04:19 INFO - PROCESS | 2455 | RSS: Main: 154279936 10:04:19 INFO - PROCESS | 2455 | 10:04:21 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51258/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:04:21 INFO - PROCESS | 2455 | RSS: Main: 154644480 10:04:21 INFO - PROCESS | 2455 | 10:04:23 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51258/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:04:24 INFO - PROCESS | 2455 | RSS: Main: 154685440 10:04:24 INFO - PROCESS | 2455 | 10:04:26 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51258/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:04:27 INFO - PROCESS | 2455 | RSS: Main: 154861568 10:04:27 INFO - PROCESS | 2455 | 10:04:30 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51258/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:04:30 INFO - PROCESS | 2455 | RSS: Main: 154939392 10:04:30 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | Cycle 1(1): loaded http://localhost:51258/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51258/tests/kraken/driver.html?testName=ai-astar) 10:04:32 INFO - PROCESS | 2455 | RSS: Main: 156643328 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | __start_tp_report 10:04:32 INFO - PROCESS | 2455 | _x_x_mozilla_page_load 10:04:32 INFO - PROCESS | 2455 | _x_x_mozilla_page_load_details 10:04:32 INFO - PROCESS | 2455 | |i|pagename|runs| 10:04:32 INFO - PROCESS | 2455 | |0;ai-astar;103;116;114;113;116;113;114;113;114;114 10:04:32 INFO - PROCESS | 2455 | |1;audio-beat-detection;145;125;120;158;122;120;119;121;149;117 10:04:32 INFO - PROCESS | 2455 | |2;audio-dft;164;164;164;162;162;165;162;162;162;164 10:04:32 INFO - PROCESS | 2455 | |3;audio-fft;76;77;74;114;77;75;77;77;97;77 10:04:32 INFO - PROCESS | 2455 | |4;audio-oscillator;84;83;103;84;83;83;94;82;83;102 10:04:32 INFO - PROCESS | 2455 | |5;imaging-gaussian-blur;118;118;117;118;118;118;119;118;118;118 10:04:32 INFO - PROCESS | 2455 | |6;imaging-darkroom;147;147;149;149;148;149;149;149;150;147 10:04:32 INFO - PROCESS | 2455 | |7;imaging-desaturate;85;85;84;86;86;85;85;85;85;86 10:04:32 INFO - PROCESS | 2455 | |8;json-parse-financial;53;54;55;53;52;56;58;54;57;54 10:04:32 INFO - PROCESS | 2455 | |9;json-stringify-tinderbox;60;60;59;60;60;59;59;59;60;59 10:04:32 INFO - PROCESS | 2455 | |10;stanford-crypto-aes;77;75;77;83;86;80;78;76;75;78 10:04:32 INFO - PROCESS | 2455 | |11;stanford-crypto-ccm;129;125;123;120;120;121;127;122;162;131 10:04:32 INFO - PROCESS | 2455 | |12;stanford-crypto-pbkdf2;154;153;156;155;153;161;155;159;153;153 10:04:32 INFO - PROCESS | 2455 | |13;stanford-crypto-sha256-iterative;63;63;63;63;63;63;67;63;61;63 10:04:32 INFO - PROCESS | 2455 | __end_tp_report 10:04:32 INFO - PROCESS | 2455 | __start_cc_report 10:04:32 INFO - PROCESS | 2455 | _x_x_mozilla_cycle_collect,767 10:04:32 INFO - PROCESS | 2455 | __end_cc_report 10:04:32 INFO - PROCESS | 2455 | __startTimestamp1485972272749__endTimestamp 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | ------- Summary: start ------- 10:04:32 INFO - PROCESS | 2455 | Number of tests: 14 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#0] ai-astar Cycles:10 Average:113.00 Median:114.00 stddev:3.68 (3.2%) stddev-sans-first:1.17 10:04:32 INFO - PROCESS | 2455 | Values: 103.0 116.0 114.0 113.0 116.0 113.0 114.0 113.0 114.0 114.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#1] audio-beat-detection Cycles:10 Average:129.60 Median:123.50 stddev:15.01 (12.2%) stddev-sans-first:14.85 10:04:32 INFO - PROCESS | 2455 | Values: 145.0 125.0 120.0 158.0 122.0 120.0 119.0 121.0 149.0 117.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#2] audio-dft Cycles:10 Average:163.10 Median:164.00 stddev:1.20 (0.7%) stddev-sans-first:1.22 10:04:32 INFO - PROCESS | 2455 | Values: 164.0 164.0 164.0 162.0 162.0 165.0 162.0 162.0 162.0 164.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#3] audio-fft Cycles:10 Average:82.10 Median:77.00 stddev:13.01 (16.9%) stddev-sans-first:13.61 10:04:32 INFO - PROCESS | 2455 | Values: 76.0 77.0 74.0 114.0 77.0 75.0 77.0 77.0 97.0 77.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#4] audio-oscillator Cycles:10 Average:88.10 Median:83.00 stddev:8.33 (10.0%) stddev-sans-first:8.71 10:04:32 INFO - PROCESS | 2455 | Values: 84.0 83.0 103.0 84.0 83.0 83.0 94.0 82.0 83.0 102.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#5] imaging-gaussian-blur Cycles:10 Average:118.00 Median:118.00 stddev:0.47 (0.4%) stddev-sans-first:0.50 10:04:32 INFO - PROCESS | 2455 | Values: 118.0 118.0 117.0 118.0 118.0 118.0 119.0 118.0 118.0 118.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#6] imaging-darkroom Cycles:10 Average:148.40 Median:149.00 stddev:1.07 (0.7%) stddev-sans-first:1.01 10:04:32 INFO - PROCESS | 2455 | Values: 147.0 147.0 149.0 149.0 148.0 149.0 149.0 149.0 150.0 147.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#7] imaging-desaturate Cycles:10 Average:85.20 Median:85.00 stddev:0.63 (0.7%) stddev-sans-first:0.67 10:04:32 INFO - PROCESS | 2455 | Values: 85.0 85.0 84.0 86.0 86.0 85.0 85.0 85.0 85.0 86.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#8] json-parse-financial Cycles:10 Average:54.60 Median:54.50 stddev:1.90 (3.5%) stddev-sans-first:1.92 10:04:32 INFO - PROCESS | 2455 | Values: 53.0 54.0 55.0 53.0 52.0 56.0 58.0 54.0 57.0 54.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#9] json-stringify-tinderbox Cycles:10 Average:59.50 Median:60.00 stddev:0.53 (0.9%) stddev-sans-first:0.53 10:04:32 INFO - PROCESS | 2455 | Values: 60.0 60.0 59.0 60.0 60.0 59.0 59.0 59.0 60.0 59.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#10] stanford-crypto-aes Cycles:10 Average:78.50 Median:78.00 stddev:3.57 (4.6%) stddev-sans-first:3.74 10:04:32 INFO - PROCESS | 2455 | Values: 77.0 75.0 77.0 83.0 86.0 80.0 78.0 76.0 75.0 78.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#11] stanford-crypto-ccm Cycles:10 Average:128.00 Median:126.00 stddev:12.53 (9.9%) stddev-sans-first:13.29 10:04:32 INFO - PROCESS | 2455 | Values: 129.0 125.0 123.0 120.0 120.0 121.0 127.0 122.0 162.0 131.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:155.20 Median:155.00 stddev:2.78 (1.8%) stddev-sans-first:2.92 10:04:32 INFO - PROCESS | 2455 | Values: 154.0 153.0 156.0 155.0 153.0 161.0 155.0 159.0 153.0 153.0 10:04:32 INFO - PROCESS | 2455 | 10:04:32 INFO - PROCESS | 2455 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.20 Median:63.00 stddev:1.48 (2.3%) stddev-sans-first:1.56 10:04:32 INFO - PROCESS | 2455 | Values: 63.0 63.0 63.0 63.0 63.0 63.0 67.0 63.0 61.0 63.0 10:04:32 INFO - PROCESS | 2455 | -------- Summary: end -------- 10:04:32 INFO - PROCESS | 2455 | 10:04:33 INFO - TEST-INFO | 2455: exit 0 10:04:33 INFO - TEST-OK | kraken | took 60009ms 10:04:33 INFO - SUITE-END | took 1171s 10:04:33 INFO - Completed test suite (00:19:31) 10:04:33 INFO - javascript benchmark 10:04:33 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7322.1401231594955, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3262.265990152216, 3281.34373125375, 3299.208190034391, 3300.861202885004, 3304.8678052877885, 5636.3799982002, 5704.030314846475, 5711.685857277853, 5725.57058220633, 5752.769889204432, 5771.624844385112, 5784.929787989215, 5792.0, 5807.41925807419, 5845.269341332333, 5199.298094757207, 5228.764705588258, 5244.056069907415, 5263.842084737464, 5289.338832645919, 5288.576913846883, 5289.735513224343, 5292.285541451913, 5296.682199068049, 5328.254044433782, 5112.948870511303, 5134.768935397916, 5261.447548007462, 5281.419043905167, 5290.576753859701, 5169.017886601552, 5194.065068287726, 5251.684898906078, 5300.337457817773, 5369.328833895763, 5180.0, 5266.315379000705, 5280.656757310762, 5303.0, 5317.388500322474, 5473.863153421156, 5666.121751128581, 5700.144978253254, 5739.569532285053, 5813.186153938452, 5937.792177273818, 6026.276846778371, 6110.327863934964, 6111.663858487781, 6136.509079273647, 6132.368817755296, 6149.846253843645, 6158.261008678943, 6254.343293954114, 6260.5304602154565, 5817.389174136697, 5820.330661973885, 5825.359210486843, 5841.85395365115, 5843.649381037151, 6174.104754810617, 6219.564630475823, 6273.278572964167, 6330.556861019684, 6336.651484168323, 6039.7282122304605, 6067.059605761114, 6073.726682299307, 6113.816585502442, 6129.172561704202, 5952.345242023374, 6112.245406105256, 6129.664444256096, 6136.274005701014, 6191.845203869849, 5918.733656985446, 6089.969550152309, 6116.663583502861, 6139.2325959255095, 6199.0, 6169.352218017133, 6187.288461826857, 6204.348543402968, 6206.348333425016, 6243.032329988859, 4613.0543238636, 4729.408823897013, 4739.905201896012, 4746.098241334135, 4778.474367819537, 4157.043879907638, 4193.874183774492, 4202.075543380452, 4248.660107191417, 4282.528921818597, 5875.20684707559, 5891.49922256613, 5908.084246941731, 5943.375945525744, 5971.671558064261, 6249.0938813871735, 6261.060840873905, 6265.0, 6268.0, 6285.120083188357, 5710.8001219957105, 5804.622699524517, 5837.737301821428, 5861.824145275648, 5863.061910094364, 5310.548603368679, 5319.042572337016, 5327.280817089643, 5344.599155063386, 5345.812896548602, 6375.649339286384, 6385.840353991188, 6390.041493775971, 6392.968035159794, 6402.519811014193, 6032.276126864629, 6035.336113027475, 6084.3915608440575, 6106.267247930276, 6155.446009859134, 6361.650109244036, 6372.522060845363, 6376.0, 6392.073149393219, 6393.712282947372, 6040.728167232397, 6071.301800293023, 6081.483073938764, 6086.360932102242, 6095.908561371494, 6024.87950240984, 6089.69551522431, 6128.050152226412, 6209.503239740719, 6215.689215539295, 5950.404959504015, 5985.521158307412, 5988.6107403020405, 6012.3386427493815, 6019.127226552213, 5923.289205295392, 6011.218541589566, 6055.666938318434, 6060.848478788065, 6063.484603808725, 5759.337676167294, 5870.913880932041, 6040.939590604038, 6044.576879618385, 6074.483668888194, 5915.70421478933, 5937.851553711192, 5972.970135149297, 6009.819705408845, 6044.0, 5902.734376952962, 5920.526357891445, 5923.46688797993, 5927.644341339534, 5935.495482884004], "value": 5676.982974061706, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [582.2837909371473, 621.2296752027486, 636.4494712074056, 662.8873091574432, 680.669875110571, 43324.566754332445, 44490.555094449046, 45110.77444612776, 49041.0, 49173.0, 45800.312995305096, 45877.0, 46304.53695463044, 46602.30096548546, 46668.0, 8867.29061675066, 9008.279337653004, 9024.0, 9047.050059743731, 9060.818783624323, 8911.153440423182, 8927.0, 8950.910490895105, 8979.685711000084, 9020.503872287021, 9086.681966131187, 9118.17936385725, 9132.132447417485, 9141.451512909214, 9189.540522973857, 9013.233875120623, 9030.593623286935, 9057.275417966546, 9063.365564410495, 9101.317401194938, 8951.149640784115, 9006.234470070052, 9010.27917766577, 9034.638614455414, 9049.683261085831, 43340.0, 43734.781326093485, 44005.55994440047, 44096.779516102215, 44115.55884441147, 3473.096994781375, 3592.8742494012845, 3621.7102631789394, 3716.535433070866, 3939.5666476687543, 32479.0, 32809.50785738216, 33159.668403315896, 33185.87388468166, 33582.83208583966, 4213.936790948138, 4380.080183161508, 4420.270655341897, 4452.732836029816, 4485.573870482299, 368973.0, 378388.0, 379236.0, 379943.0, 382389.0880545607, 64788.352116479175, 65556.67221663862, 65731.67134164298, 65763.34236657667, 65831.67084164548, 70191.29808701847, 70963.0, 71072.64463677649, 71120.0, 71229.6438517804, 17905.820941790415, 17998.91000544989, 18023.72964405535, 18027.459176224733, 18153.273869045355, 13611.795823062663, 13724.588262352145, 13778.65553361174, 13783.793243101361, 13785.0, 19698.901505492668, 20518.0, 20684.965751712356, 20739.170433182502, 20838.895805520875, 3597.406427939413, 3648.2703459308245, 7453.403727701771, 7593.368045492245, 7703.383729301642, 935.1770442011123, 1005.4922264256504, 1072.7747173093737, 1103.900648941599, 1124.1793490751797, 31553.0, 31602.683973159976, 32258.0, 32272.60236328643, 32298.192545186557, 1055.6621880998007, 1180.362604193743, 1181.3915833345834, 1184.9526018959318, 1218.9695257618453, 16756.32974680999, 17167.31330746781, 17288.308467661154, 17316.39392621252, 17319.65360692779, 507528.08595526865, 511189.0, 513583.0, 516423.0, 516967.0, 61623.0, 62241.0, 62277.0, 62384.376156238766, 62582.37417625856, 1376.0367742580233, 1385.6605131742788, 1387.6253411578816, 1429.9285035748171, 1456.8834493240515, 30824.537631935986, 31317.53023704601, 31785.36429271448, 32303.35393292074, 32508.02475925726, 53862.730686346316, 54250.72874635601, 54283.0, 54307.55615997368, 54334.45665543294, 420982.0, 421834.0, 423456.0, 424318.878405606, 427147.0, 29937.85031074831, 30150.69849301479, 30541.236469087562, 30558.08325750231, 30630.540541892336, 47573.28640070471, 48088.75955620199, 48471.75764121157, 48774.0, 49578.75210623924, 41975.160496789285, 42313.78843105888, 42737.786311068245, 42756.0, 44219.77890110529, 41288.587114129674, 41509.58490415057, 42299.57700423079, 43030.35454468123, 43692.34461483144, 41303.38044929389, 41768.791156044026, 42805.78597106995, 43077.784611078, 43154.78422607992, 34746.0, 37347.25305493929, 37585.0, 37756.811215943744, 38080.42879356757, 28489.28776780597, 28670.85664571747, 28720.0, 28835.0, 28846.423071538873], "value": 20778.06584093614, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [422.2273239970852, 424.13264873334026, 427.60019381877964, 432.16591977483466, 450.4616982705666, 18911.24355025799, 19578.804211957893, 20550.280740174097, 20663.58672826546, 20687.275945341917, 16042.117683527402, 18498.167582458787, 19121.904390478026, 19450.221991120372, 19644.410667679993, 5760.56795740319, 5944.108383742451, 6022.126791615235, 6030.9396906030815, 6043.3956604339655, 5742.54059675225, 5833.708314584275, 5884.235049443566, 5951.85120371992, 5954.523638108941, 5801.245838041049, 5843.737031833578, 5849.619774714652, 5854.268216472941, 5855.824325270228, 5670.716464176816, 5846.2107615472005, 5861.472467477926, 5864.413558644144, 5922.970385148046, 5305.973470132624, 5314.893702125974, 5343.492368225013, 5357.973210133924, 5368.463153684639, 23002.30993070194, 23288.767112329, 23557.411064723346, 23640.763592364026, 23669.0, 2426.381272775431, 2564.3204550794053, 2603.4662894106664, 2867.913962581126, 2894.2619631993916, 13933.0, 14790.334434950453, 14798.556043318718, 15016.24918754058, 15316.081035137817, 1959.7648282206085, 2055.43475544225, 2067.9483012924647, 2077.5637116205617, 2105.768365479796, 80175.5991220046, 80339.0, 80778.0, 81561.0, 82680.58659706663, 10830.566777328977, 10981.39602321864, 11019.173561982723, 11109.555617775199, 11299.723080306783, 15708.921455392878, 15715.528534143994, 15728.213589320489, 15770.211489425483, 15846.128462934419, 8528.488290702579, 8565.400421970402, 8739.51932643698, 8818.735437936872, 8877.701192711937, 8580.399372044021, 8582.442141260799, 8716.21554060125, 8901.154390332907, 9028.8645670315, 6811.386975172259, 6935.514513983972, 6937.895931561031, 7064.258252883476, 7085.645717714094, 2032.9593408131755, 2083.2812679625504, 2096.465401322653, 2096.695979083055, 2103.116690989788, 940.5579377692474, 982.6757170133839, 995.1392045880261, 996.7508122969258, 1002.6340385759146, 19405.611887762167, 19460.0, 19514.31699890497, 19634.70547941782, 19818.405447836587, 991.5339790298548, 1026.8716410448694, 1027.5838285494387, 1071.989280107189, 1082.631905152252, 10785.298955567863, 11018.50416731249, 11155.107591392669, 11234.775304493864, 11257.774844503065, 412899.0, 418505.0, 420059.7994020082, 427643.0, 428723.0, 68455.0, 76919.23080769232, 77377.6131119352, 79623.20376796274, 82255.58872205601, 1008.5108722269694, 1018.2108865629049, 1070.3845288958723, 1070.8661417322835, 1074.0387353318736, 17450.563735906195, 17527.649447011245, 18000.63998719992, 18180.72728909041, 18390.908045459688, 43951.560484394744, 44805.0, 44875.551244487135, 44936.55063449324, 45498.772506137255, 61314.38685613087, 61975.38024619696, 62432.375676244475, 63028.0, 63608.68195658992, 8808.603612837309, 9031.232345250728, 9090.59092340833, 9184.219341355792, 9264.305177111608, 12703.42834572465, 13371.331433428095, 13489.797653035408, 13661.590152295446, 13758.449662013407, 11836.408179590813, 11946.701332466759, 12246.816297755719, 12344.259344439362, 12468.937655311665, 11624.128190385924, 11687.357195353998, 12018.158728888893, 12062.45718942632, 12312.75374492523, 11200.495977680861, 11333.376664283214, 11831.822522661994, 11961.581344652895, 12248.265104093784, 8657.09100544459, 8953.149450802164, 8963.282937364866, 9123.406978546373, 9204.171624553823, 10609.098226650822, 11543.36511491876, 11756.059515238589, 11903.245706552883, 11942.104342174545], "value": 9619.881303119251, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1495.3719437836112, 1508.8491150884909, 1673.5230459319089, 1776.671315806575, 1801.2524802207076, 7434.814129646761, 7661.731839385623, 8150.510969341836, 8406.11735767744, 8443.957780211098, 8003.279704826565, 8297.668093276277, 8317.168283171679, 8396.1603839616, 8524.360672949522, 2386.451116243265, 2419.0565679384968, 2421.7336093029753, 2422.430728778744, 2423.4910668759494, 2412.2401443545314, 2419.9516009679796, 2448.461338505535, 2451.4974430241846, 2466.580681284186, 2397.8561286322874, 2414.28778510339, 2434.257551446808, 2448.485817978227, 2451.521953219123, 2317.2468947592015, 2334.3580515358244, 2337.0651739304244, 2341.1805867946255, 2356.552255071531, 2348.5302939412186, 2359.634256690216, 2360.7639236076425, 2375.904963801446, 2382.1781485387514, 8353.582320883932, 8475.279601233902, 8498.532580708059, 8520.829583408358, 8528.403011789178, 5142.665726727788, 5171.689698618095, 5303.36359636846, 5305.124654432014, 5313.7608807603365, 3219.2434777827193, 3225.0808519572042, 3260.8858689945737, 3294.8352582370785, 3311.4867195584725, 1036.3574583758043, 1041.8385150301715, 1056.5932116135266, 1086.6359769477235, 1097.253867370188, 11496.712582185428, 11548.53805847765, 11615.883841161565, 11624.186306958516, 11658.06735461161, 4277.337012763027, 4530.252508336088, 4559.954400456019, 4580.1755683976535, 4587.839425620087, 9209.35534512591, 9216.493092879822, 9226.123518265755, 9231.446113233227, 9263.953680231556, 5153.17549192135, 5161.27742116104, 5163.612729045337, 5165.1219292720325, 5179.456157103526, 4656.138614356355, 4788.856334309976, 4860.076585448754, 4910.0, 4924.704517728947, 3771.30230907283, 3868.458415821787, 3902.297586434412, 3916.1580260244186, 3977.801109944491, 1195.7488927325185, 1196.3180986837592, 1204.560335477562, 1214.6416807041944, 1219.71336735867, 957.5164541906292, 981.7349315684725, 982.2878413150409, 1000.4847503535685, 1009.9343542669703, 5567.972160139255, 5630.577706672016, 5828.300603927556, 5875.265591801025, 5907.793227237026, 460.63149480415535, 463.04150408653766, 468.32794939262266, 469.83555755485304, 472.06531068484594, 4050.0482386639114, 4148.481439820022, 4158.750474971512, 4178.1643671265865, 4183.477065366829, 9993.800123997626, 10307.123894468905, 10377.377357358582, 10393.06462418386, 10450.268481206243, 10255.641052563275, 10301.0, 10308.587656493657, 10318.845217321747, 10319.74200644975, 7576.356009739124, 7797.376209903194, 7834.921650783534, 7884.526928384315, 7886.211378862183, 5709.857253568694, 5721.57088218377, 5793.04414771558, 5996.37038110992, 6098.451139397475, 9497.620095196115, 9596.9040309596, 9654.75863103428, 9660.130588247092, 9674.08096230857, 9330.440173589606, 9529.142377186086, 9599.952000239955, 9637.566309516229, 9714.514274286115, 7228.4578656599915, 7295.671694773641, 7403.7408690695565, 7493.0, 7703.383729301754, 8291.751247462586, 8345.207205315486, 8404.663813447394, 8414.6213420395, 8432.83134337322, 7209.819754506179, 7236.4210863131875, 7261.237570055279, 7264.963675181802, 7361.926380736339, 7327.120745510573, 7401.1488678802625, 7403.481756277009, 7418.109826820816, 7488.213737557696, 6691.063251144747, 6804.727810887509, 6808.863822723617, 6812.420944219599, 6825.0, 4926.285688575208, 4944.456109827988, 4946.233333833262, 4958.528939750718, 5117.411497677815, 4953.578945789504, 5003.724795136302, 5016.448190699093, 5065.949340506695, 5176.559992400688], "value": 4446.249217767576, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [353.1471496336348, 360.45211278856135, 364.89965259553634, 365.52328592486356, 368.69398399328554, 5478.822053258548, 5592.384837667853, 5601.80393686221, 5694.487496125343, 5709.571782116343, 5427.43011983742, 5554.555635549156, 5592.734942348346, 5594.916076258859, 5617.0, 4414.955850441486, 4417.867463976086, 4421.182081314951, 4441.977790111045, 4449.688521803475, 4102.0, 4321.308590625501, 4362.8036738346855, 4396.582324679151, 4397.582229688191, 4264.637505811994, 4298.763568003758, 4317.309230523117, 4322.675799315049, 4333.198358303708, 4296.5273819879785, 4300.892477688051, 4307.375430562583, 4317.740935543878, 4331.45856767904, 3693.9445908311395, 3787.867424640124, 3793.2792769374005, 3799.7910114943666, 3809.5618803965485, 5417.620766546304, 5442.156465747816, 5445.891082178374, 5456.454354564551, 5460.153676180198, 4993.525615066599, 5000.0, 5000.224965130375, 5011.774470148852, 5037.093323201822, 5576.6375185613215, 5838.241028666289, 5856.502197313233, 5857.853553661193, 5883.17635531026, 4254.340577210537, 4258.360531195481, 4262.232798096342, 4266.701330906838, 4274.764887931163, 6069.0592958091565, 6085.300190478108, 6152.72312745923, 6157.599756015889, 6175.5985860919345, 4225.640820530228, 4306.978465107717, 4363.38912552243, 4365.978170109129, 4410.823567057346, 4385.298352263686, 4385.342198670161, 4409.889752756207, 4411.0, 4421.7789110544345, 4973.2042873140845, 4987.326710893983, 4999.3000979862845, 5004.974975125101, 5013.849584512471, 5741.368449470555, 5863.768608592158, 5879.52963762898, 5909.556783241188, 5938.18885240006, 1467.222372142766, 1478.571214347827, 1478.9942838869456, 1480.3782411387244, 1488.947886823956, 962.5427921737119, 1000.1148983149819, 1006.2101250518308, 1008.7931973945324, 1020.6529779874878, 5528.281323428009, 5541.5843811714285, 5542.528885044816, 5550.777968881281, 5569.303837020372, 5774.018416869142, 5786.392428795, 5813.215215945877, 5834.970825145847, 5878.911816322759, 5332.30680011596, 5458.972705136528, 5482.945170548323, 5493.560515158778, 5524.138757893109, 3101.72084512395, 3102.612173478315, 3128.9843550782102, 3132.7180553750272, 3136.2473006478735, 5784.566157538117, 5926.2295901532525, 6013.857367100237, 6075.27096748393, 6077.8480537986015, 5822.651975114241, 5955.34491205967, 5960.493358064527, 5971.7611295547695, 6007.609505382136, 5992.43071908168, 6018.8194354169445, 6022.584692597236, 6028.125921741323, 6039.691972713066, 5658.152456329571, 5750.769969201352, 5863.768608592243, 5871.970640146772, 5902.911456328073, 5774.220480235283, 5777.480026797609, 5786.842631473806, 5791.7683292667825, 5831.446012628793, 5951.732172052181, 6033.637981721111, 6036.158971513731, 6046.0, 6195.659238741912, 4311.913761724811, 4409.206342858316, 4423.871912662251, 4443.289073748185, 4451.3323001550025, 6002.0, 6016.789412370546, 6022.789202377896, 6031.939680603314, 6061.484773794277, 5660.698039450867, 5817.5345972321265, 5844.211031510862, 5851.268591426072, 5931.0, 5904.3210030847, 5915.615484993462, 5916.0, 5931.7627294907725, 5943.791967281298, 5874.676892770939, 5896.761680047067, 5914.645121292564, 5927.170196172626, 5937.2578427696535, 5692.51613612831, 5920.467157955804, 5956.987312156857, 5967.9701601491715, 5986.850328741816, 5859.798741258117, 5862.534366408398, 5869.0, 5873.676947767743, 5874.412558744091], "value": 4457.705968514205, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [753.7350262461302, 763.076677220563, 829.2826704900261, 850.7617866997235, 869.6260607938586, 14801.851981480182, 15536.378544858206, 16218.351265949363, 16233.107179105144, 16254.0, 14418.279086045708, 14581.270936453187, 14612.977091603592, 14668.413263469474, 14734.705305893876, 819.7868554175913, 831.846108469935, 832.9791755206107, 834.015861283685, 835.4319063037133, 807.1363640904235, 808.0182578167526, 809.7854068671807, 809.9068607110199, 811.9797005074861, 860.6514361683497, 871.3247233394106, 871.525018864717, 871.790770215147, 874.7200895713374, 856.648774002659, 858.0132847225678, 859.660434128522, 861.5821326656567, 864.1660797330607, 640.3628389752226, 640.3980258556942, 642.7332656947361, 643.1060825452624, 643.2731013954249, 13241.668958276025, 13247.138935969131, 13271.800922986164, 13281.136726112773, 13340.466381344735, 12008.939955300168, 12026.338551379671, 12314.630561083091, 12588.4335204916, 12608.936955315165, 10722.249442539025, 10799.0, 10850.131989440904, 10989.450527473675, 11026.944865275622, 3756.398976163828, 3766.642168993941, 3798.601146879593, 3832.9616703832885, 3924.607539246081, 61095.389046109856, 62480.37519624791, 62844.685776571736, 62893.056604150974, 63671.0, 8662.220400164015, 8691.261242794433, 8714.433561818461, 8746.431481953652, 8863.379563430499, 18019.72970405445, 18127.09364531768, 18138.455846324632, 18170.727439088423, 18199.272029118685, 7459.701611935462, 7822.647980840876, 7846.411519136088, 8416.957915210507, 8481.491110533389, 4666.533346665306, 4842.854714358575, 4957.3059771632, 5064.341635587423, 5068.315777370081, 3397.8810741623925, 3480.8781692640637, 3485.9477107843404, 3505.789652620851, 3510.7015903647966, 610.1640752169468, 621.4748537485817, 621.7295476467751, 643.3727116061802, 654.3554598720257, 652.3867564489365, 672.9831754206086, 691.68182635987, 700.1073631120261, 714.6426786606696, 9045.095490451034, 9067.648962118466, 9274.67538636158, 9297.16325530692, 9400.717978460658, 597.7788218359235, 622.5113286070413, 633.5786701843315, 670.6143967218869, 674.5750177388214, 4449.243628583149, 4488.506264310923, 4508.098380323949, 4532.478764942008, 4535.841245556389, 92433.53783231041, 92693.53653231691, 92797.53601231951, 93706.0, 94546.0, 47432.28851567229, 49042.0, 51041.48958510367, 63237.68381158157, 73832.63083684654, 66212.66893665501, 66453.0, 68105.0, 68260.6586967062, 70426.0, 9026.81946361056, 9118.772030699285, 9156.771080723036, 9193.172614464731, 9217.907820921973, 43583.0, 46402.6079217624, 46597.53402465932, 47580.76209619068, 47939.76030119827, 39316.0, 42610.36084458797, 42833.78583107064, 57553.71223143858, 62617.0, 11045.226834121855, 11160.44197790091, 11166.888331116585, 11202.327860328407, 11349.0, 13010.544630937871, 13022.4139913706, 13101.475940962255, 13118.409671564994, 13328.866711332763, 11995.940020299842, 12007.339596322287, 12062.466881954888, 12253.448594813077, 12660.936695316464, 11806.822897656713, 12008.279503229835, 12093.09301802386, 12411.875881241072, 12653.240805551697, 11507.194496385173, 11721.882781172078, 11793.29240245588, 11988.580399686318, 12028.037756979245, 9206.447613143233, 9327.0, 9519.714408567754, 9593.811991265735, 9713.27150463704, 10253.743656408351, 10334.586616535255, 10358.430286334324, 10386.844197337197, 10436.478176091014], "value": 6851.496180834193, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1466.5, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 116.0, 114.0, 113.0, 116.0, 113.0, 114.0, 113.0, 114.0, 114.0], "value": 113.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 125.0, 120.0, 158.0, 122.0, 120.0, 119.0, 121.0, 149.0, 117.0], "value": 129.6, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 164.0, 164.0, 162.0, 162.0, 165.0, 162.0, 162.0, 162.0, 164.0], "value": 163.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 74.0, 114.0, 77.0, 75.0, 77.0, 77.0, 97.0, 77.0], "value": 82.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 83.0, 103.0, 84.0, 83.0, 83.0, 94.0, 82.0, 83.0, 102.0], "value": 88.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 117.0, 118.0, 118.0, 118.0, 119.0, 118.0, 118.0, 118.0], "value": 118.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 149.0, 149.0, 148.0, 149.0, 149.0, 149.0, 150.0, 147.0], "value": 148.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 84.0, 86.0, 86.0, 85.0, 85.0, 85.0, 85.0, 86.0], "value": 85.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [53.0, 54.0, 55.0, 53.0, 52.0, 56.0, 58.0, 54.0, 57.0, 54.0], "value": 54.6, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 60.0, 59.0, 60.0, 60.0, 59.0, 59.0, 59.0, 60.0, 59.0], "value": 59.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 75.0, 77.0, 83.0, 86.0, 80.0, 78.0, 76.0, 75.0, 78.0], "value": 78.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [129.0, 125.0, 123.0, 120.0, 120.0, 121.0, 127.0, 122.0, 162.0, 131.0], "value": 128.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 153.0, 156.0, 155.0, 153.0, 161.0, 155.0, 159.0, 153.0, 153.0], "value": 155.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 63.0, 63.0, 63.0, 63.0, 67.0, 63.0, 61.0, 63.0], "value": 63.2, "unit": "score"}]}]} 10:04:33 INFO - Return code: 0 10:04:34 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 10:04:34 ERROR - # TBPL SUCCESS # 10:04:34 INFO - Running post-action listener: _resource_record_post_action 10:04:34 INFO - [mozharness: 2017-02-01 18:04:34.052534Z] Finished run-tests step (success) 10:04:34 INFO - Running post-run listener: _resource_record_post_run 10:04:34 INFO - Total resource usage - Wall time: 1186s; CPU: 13.0%; Read bytes: 4096; Write bytes: 322875392; Read time: 16; Write time: 271652 10:04:34 INFO - TinderboxPrint: CPU usage
13.3% 10:04:34 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 10:04:34 INFO - TinderboxPrint: I/O write bytes / time
322,875,392 / 271,652 10:04:34 INFO - TinderboxPrint: CPU idle
8,207.2 (86.7%) 10:04:34 INFO - TinderboxPrint: CPU user
1,201.4 (12.7%) 10:04:34 INFO - TinderboxPrint: Swap in / out
0 / 0 10:04:34 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 102596608; Read time: 0; Write time: 124040 10:04:34 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 4096; Write bytes: 220278784; Read time: 16; Write time: 147612 10:04:34 INFO - Running post-run listener: _upload_blobber_files 10:04:34 INFO - Blob upload gear active. 10:04:34 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:04:34 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 10:04:34 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-Beta', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:04:34 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-Beta -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:04:35 INFO - (blobuploader) - INFO - Open directory for files ... 10:04:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 10:04:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:04:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:04:35 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 10:04:35 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:04:35 INFO - (blobuploader) - INFO - Done attempting. 10:04:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 10:04:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:04:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:04:39 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 10:04:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:04:39 INFO - (blobuploader) - INFO - Done attempting. 10:04:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 10:04:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:04:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:04:39 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 10:04:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:04:39 INFO - (blobuploader) - INFO - Done attempting. 10:04:39 INFO - (blobuploader) - INFO - Iteration through files over. 10:04:39 INFO - Return code: 0 10:04:39 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:04:39 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:04:39 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/ca2ed57e0cf087a9f17d4e7fbc4d1892b97f606de5c19abbd97856cdf8705a02e561cb7e0c89993338edee4c829a5c10605e55301fa4984067bf3d32bc283b93", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/91e8272018d0709ed0ad804a4b562c99a471c831c062cef96c054f4422e680d19a133dc6971150d37b9e1ee4b8af6da610e8e0d96116c4694cb5169f3de643da", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/c5e0f201d33ef0ffd7b3b3baaa759332d9b036441c0aa7b92dbd5ee6e64c0ec1186d43eb4342a480a570b66ec69d80d6e5eb47dbcfea4cad1b69552ed0c47c9d"} 10:04:39 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:04:39 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:04:39 INFO - Contents: 10:04:39 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/ca2ed57e0cf087a9f17d4e7fbc4d1892b97f606de5c19abbd97856cdf8705a02e561cb7e0c89993338edee4c829a5c10605e55301fa4984067bf3d32bc283b93", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/91e8272018d0709ed0ad804a4b562c99a471c831c062cef96c054f4422e680d19a133dc6971150d37b9e1ee4b8af6da610e8e0d96116c4694cb5169f3de643da", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/c5e0f201d33ef0ffd7b3b3baaa759332d9b036441c0aa7b92dbd5ee6e64c0ec1186d43eb4342a480a570b66ec69d80d6e5eb47dbcfea4cad1b69552ed0c47c9d"} 10:04:39 INFO - Running post-run listener: copy_logs_to_upload_dir 10:04:39 INFO - Copying logs to upload dir... 10:04:39 INFO - mkdir: /builds/slave/test/build/upload/logs 10:04:39 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1229.354483 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 29 secs) (at 2017-02-01 10:04:39.361797) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-01 10:04:39.367161) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219 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-Beta/sha512/ca2ed57e0cf087a9f17d4e7fbc4d1892b97f606de5c19abbd97856cdf8705a02e561cb7e0c89993338edee4c829a5c10605e55301fa4984067bf3d32bc283b93", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/91e8272018d0709ed0ad804a4b562c99a471c831c062cef96c054f4422e680d19a133dc6971150d37b9e1ee4b8af6da610e8e0d96116c4694cb5169f3de643da", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/c5e0f201d33ef0ffd7b3b3baaa759332d9b036441c0aa7b92dbd5ee6e64c0ec1186d43eb4342a480a570b66ec69d80d6e5eb47dbcfea4cad1b69552ed0c47c9d"} build_url:https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011428 build_url: 'https://queue.taskcluster.net/v1/task/Gampq9LBQA-ykub2HoIsWQ/artifacts/public/build/firefox-52.0.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/ca2ed57e0cf087a9f17d4e7fbc4d1892b97f606de5c19abbd97856cdf8705a02e561cb7e0c89993338edee4c829a5c10605e55301fa4984067bf3d32bc283b93", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/91e8272018d0709ed0ad804a4b562c99a471c831c062cef96c054f4422e680d19a133dc6971150d37b9e1ee4b8af6da610e8e0d96116c4694cb5169f3de643da", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Beta/sha512/c5e0f201d33ef0ffd7b3b3baaa759332d9b036441c0aa7b92dbd5ee6e64c0ec1186d43eb4342a480a570b66ec69d80d6e5eb47dbcfea4cad1b69552ed0c47c9d"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-01 10:04:39.392351) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 10:04:39.392911) ========= 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=a4ce256d2ec601f24a60a71e000001bc-1485971049.10537-1911293219 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004486 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 10:04:39.477781) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-01 10:04:39.478311) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-01 10:04:39.478643) ========= ========= Total master_lag: 0.17 =========