builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-002 starttime: 1461976046.22 results: success (0) buildid: 20160429160640 builduid: 77de13f2244b440ca7bbbe51519667d4 revision: 8471d2d75bf43d0ad1c2cb069eb331e481a8d01a ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:26.218728) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:26.219164) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:26.219443) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:26.287837) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:26.288198) ========= 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=a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-29 17:27:26-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 23.6M=0s 2016-04-29 17:27:26 (23.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.093427 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:26.399474) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:26.399783) ========= 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=a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014886 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:26.457532) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-29 17:27:26.457996) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 8471d2d75bf43d0ad1c2cb069eb331e481a8d01a --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 8471d2d75bf43d0ad1c2cb069eb331e481a8d01a --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=a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-29 17:27:26,917 truncating revision to first 12 chars 2016-04-29 17:27:26,917 Setting DEBUG logging. 2016-04-29 17:27:26,917 attempt 1/10 2016-04-29 17:27:26,917 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/8471d2d75bf4?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-29 17:27:28,139 unpacking tar archive at: fx-team-8471d2d75bf4/testing/mozharness/ program finished with exit code 0 elapsedTime=1.541403 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-29 17:27:28.012584) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:28.012909) ========= script_repo_revision: 8471d2d75bf43d0ad1c2cb069eb331e481a8d01a ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:28.014983) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:28.015253) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-29 17:27:28.027049) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-04-29 17:27:28.027390) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] 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=a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 17:27:28 INFO - MultiFileLogger online at 20160429 17:27:28 in /builds/slave/test 17:27:28 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 17:27:28 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 17:27:28 INFO - {'append_to_log': False, 17:27:28 INFO - 'base_work_dir': '/builds/slave/test', 17:27:28 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 17:27:28 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 17:27:28 INFO - 'branch': 'Fx-Team-Non-PGO', 17:27:28 INFO - 'buildbot_json_path': 'buildprops.json', 17:27:28 INFO - 'config_files': ('talos/linux_config.py',), 17:27:28 INFO - 'default_actions': ('clobber', 17:27:28 INFO - 'read-buildbot-config', 17:27:28 INFO - 'download-and-extract', 17:27:28 INFO - 'populate-webroot', 17:27:28 INFO - 'create-virtualenv', 17:27:28 INFO - 'install', 17:27:28 INFO - 'run-tests'), 17:27:28 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:27:28 INFO - 'download_minidump_stackwalk': True, 17:27:28 INFO - 'download_symbols': 'ondemand', 17:27:28 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:27:28 INFO - 'tooltool.py': '/tools/tooltool.py', 17:27:28 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:27:28 INFO - '/tools/misc-python/virtualenv.py')}, 17:27:28 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:27:28 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:27:28 INFO - 'installer_path': 'installer.exe', 17:27:28 INFO - 'log_level': 'info', 17:27:28 INFO - 'log_name': 'talos', 17:27:28 INFO - 'log_to_console': True, 17:27:28 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 17:27:28 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 17:27:28 INFO - 'opt_config_files': (), 17:27:28 INFO - 'pip_index': False, 17:27:28 INFO - 'sps_profile': False, 17:27:28 INFO - 'sps_profile_interval': 0, 17:27:28 INFO - 'suite': 'dromaeojs', 17:27:28 INFO - 'system_bits': '32', 17:27:28 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:27:28 INFO - 'title': 'talos-linux64-ix-002', 17:27:28 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:27:28 INFO - 'use_talos_json': True, 17:27:28 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 17:27:28 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:27:28 INFO - 'work_dir': 'build'} 17:27:28 INFO - ##### 17:27:28 INFO - ##### Running clobber step. 17:27:28 INFO - ##### 17:27:28 INFO - Running pre-action listener: _resource_record_pre_action 17:27:28 INFO - Running main action method: clobber 17:27:28 INFO - rmtree: /builds/slave/test/build 17:27:28 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 17:27:29 INFO - Running post-action listener: _resource_record_post_action 17:27:29 INFO - ##### 17:27:29 INFO - ##### Running read-buildbot-config step. 17:27:29 INFO - ##### 17:27:29 INFO - Running pre-action listener: _resource_record_pre_action 17:27:29 INFO - Running main action method: read_buildbot_config 17:27:29 INFO - Using buildbot properties: 17:27:29 INFO - { 17:27:29 INFO - "project": "", 17:27:29 INFO - "product": "firefox", 17:27:29 INFO - "script_repo_revision": "production", 17:27:29 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 17:27:29 INFO - "repository": "", 17:27:29 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 17:27:29 INFO - "buildid": "20160429160640", 17:27:29 INFO - "pgo_build": "False", 17:27:29 INFO - "basedir": "/builds/slave/test", 17:27:29 INFO - "buildnumber": 1624, 17:27:29 INFO - "slavename": "talos-linux64-ix-002", 17:27:29 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 17:27:29 INFO - "platform": "ubuntu64_hw", 17:27:29 INFO - "scheduler": "tests-fx-team-linux64-talos", 17:27:29 INFO - "branch": "fx-team", 17:27:29 INFO - "repo_path": "integration/fx-team", 17:27:29 INFO - "revision": "8471d2d75bf43d0ad1c2cb069eb331e481a8d01a", 17:27:29 INFO - "stage_platform": "linux64", 17:27:29 INFO - "builduid": "77de13f2244b440ca7bbbe51519667d4", 17:27:29 INFO - "slavebuilddir": "test" 17:27:29 INFO - } 17:27:29 INFO - Found installer url https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 17:27:29 INFO - Running post-action listener: _resource_record_post_action 17:27:29 INFO - ##### 17:27:29 INFO - ##### Running download-and-extract step. 17:27:29 INFO - ##### 17:27:29 INFO - Running pre-action listener: _resource_record_pre_action 17:27:29 INFO - Running main action method: download_and_extract 17:27:29 INFO - mkdir: /builds/slave/test/build/tests 17:27:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:29 INFO - https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 17:27:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 17:27:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 17:27:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 17:27:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 17:27:36 INFO - Downloaded 1361 bytes. 17:27:36 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 17:27:36 INFO - Using the following test package requirements: 17:27:36 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 17:27:36 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 17:27:36 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 17:27:36 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 17:27:36 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 17:27:36 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 17:27:36 INFO - u'jsshell-linux-x86_64.zip'], 17:27:36 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 17:27:36 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 17:27:36 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 17:27:36 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 17:27:36 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 17:27:36 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 17:27:36 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 17:27:36 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 17:27:36 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 17:27:36 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 17:27:36 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 17:27:36 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 17:27:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:36 INFO - https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 17:27:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 17:27:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 17:27:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 17:27:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 17:27:37 INFO - Downloaded 22304506 bytes. 17:27:37 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:27:37 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 17:27:39 INFO - Return code: 0 17:27:39 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 17:27: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:39 INFO - https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 17:27:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 17:27:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 17:27:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 17:27:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 17:27:41 INFO - Downloaded 22304506 bytes. 17:27:41 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:27:41 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 17:27:42 INFO - Return code: 0 17:27: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:42 INFO - https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 17:27:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 17:27:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 17:27:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 17:27:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 17:27:43 INFO - Downloaded 10840152 bytes. 17:27:43 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 17:27:43 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 17:27:43 INFO - Return code: 0 17:27:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:43 INFO - https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 17:27:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 17:27:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 17:27:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 17:27:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 17:27:45 INFO - Downloaded 54915663 bytes. 17:27:45 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 17:27:45 INFO - mkdir: /builds/slave/test/properties 17:27:45 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 17:27:45 INFO - Writing to file /builds/slave/test/properties/build_url 17:27:45 INFO - Contents: 17:27:45 INFO - build_url:https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 17:27:46 INFO - Running post-action listener: _resource_record_post_action 17:27:46 INFO - Running post-action listener: set_extra_try_arguments 17:27:46 INFO - ##### 17:27:46 INFO - ##### Running populate-webroot step. 17:27:46 INFO - ##### 17:27:46 INFO - Running pre-action listener: _resource_record_pre_action 17:27:46 INFO - Running main action method: populate_webroot 17:27:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:27:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:27:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:27:46 INFO - '--tppagecycles', 17:27:46 INFO - '7'], 17:27:46 INFO - 'tests': ['tsvgm']}}, 17:27:46 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:27:46 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 17:27:46 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['dromaeo_css', 'kraken']}, 17:27:46 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 17:27:46 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:27:46 INFO - 'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:27:46 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:27:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:27:46 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:27:46 INFO - 'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['damp', 'tps']}, 17:27:46 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:27:46 INFO - 'tests': ['damp', 'tps']}, 17:27:46 INFO - 'g3': {'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['dromaeo_dom']}, 17:27:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:27:46 INFO - 'other': {'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['a11yr', 17:27:46 INFO - 'ts_paint', 17:27:46 INFO - 'tpaint', 17:27:46 INFO - 'sessionrestore', 17:27:46 INFO - 'sessionrestore_no_auto_restore', 17:27:46 INFO - 'tabpaint']}, 17:27:46 INFO - 'other-e10s': {'tests': ['a11yr', 17:27:46 INFO - 'ts_paint', 17:27:46 INFO - 'tpaint', 17:27:46 INFO - 'sessionrestore', 17:27:46 INFO - 'sessionrestore_no_auto_restore', 17:27:46 INFO - 'tabpaint']}, 17:27:46 INFO - 'other-e10s_l64': {'tests': ['a11yr', 17:27:46 INFO - 'ts_paint', 17:27:46 INFO - 'tpaint', 17:27:46 INFO - 'sessionrestore', 17:27:46 INFO - 'sessionrestore_no_auto_restore', 17:27:46 INFO - 'tabpaint']}, 17:27:46 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 17:27:46 INFO - 'ts_paint', 17:27:46 INFO - 'tpaint', 17:27:46 INFO - 'sessionrestore', 17:27:46 INFO - 'sessionrestore_no_auto_restore', 17:27:46 INFO - 'tabpaint']}, 17:27:46 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['a11yr', 17:27:46 INFO - 'ts_paint', 17:27:46 INFO - 'tpaint', 17:27:46 INFO - 'sessionrestore', 17:27:46 INFO - 'sessionrestore_no_auto_restore', 17:27:46 INFO - 'tabpaint']}, 17:27:46 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['a11yr', 17:27:46 INFO - 'ts_paint', 17:27:46 INFO - 'tpaint', 17:27:46 INFO - 'sessionrestore', 17:27:46 INFO - 'sessionrestore_no_auto_restore', 17:27:46 INFO - 'tabpaint']}, 17:27:46 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['tsvgx', 17:27:46 INFO - 'tsvgr_opacity', 17:27:46 INFO - 'tart', 17:27:46 INFO - 'tscrollx', 17:27:46 INFO - 'cart']}, 17:27:46 INFO - 'svgr-e10s': {'tests': ['tsvgx', 17:27:46 INFO - 'tsvgr_opacity', 17:27:46 INFO - 'tart', 17:27:46 INFO - 'tscrollx', 17:27:46 INFO - 'cart']}, 17:27:46 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:27:46 INFO - 'talos_options': ['--disable-e10s'], 17:27:46 INFO - 'tests': ['tp5o']}, 17:27:46 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:27:46 INFO - 'tests': ['tp5o']}, 17:27:46 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:27:46 INFO - 'talos_options': ['--disable-e10s', 17:27:46 INFO - '--xperf_path', 17:27:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:27:46 INFO - 'tests': ['tp5n']}, 17:27:46 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:27:46 INFO - 'talos_options': ['--xperf_path', 17:27:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:27:46 INFO - 'tests': ['tp5n']}}, 17:27:46 INFO - 'talos.zip': {'path': '', 17:27:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:27:46 INFO - Running post-action listener: _resource_record_post_action 17:27:46 INFO - ##### 17:27:46 INFO - ##### Running create-virtualenv step. 17:27:46 INFO - ##### 17:27:46 INFO - Running pre-action listener: _resource_record_pre_action 17:27:46 INFO - Running main action method: create_virtualenv 17:27:46 INFO - Creating virtualenv /builds/slave/test/build/venv 17:27:46 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 17:27:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 17:27:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:27:46 INFO - Using real prefix '/usr' 17:27:46 INFO - New python executable in /builds/slave/test/build/venv/bin/python 17:27:46 INFO - Installing distribute.............................................................................................................................................................................................done. 17:27:48 INFO - Installing pip.................done. 17:27:48 INFO - Return code: 0 17:27:48 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 17:27:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:27:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:27:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:48 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 0x7f69dec13f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14ae8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x157a7d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', '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 17:27:48 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 17:27:48 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 17:27:48 INFO - Using env: {'DISPLAY': ':0', 17:27:48 INFO - 'HOME': '/home/cltbld', 17:27:48 INFO - 'LANG': 'en_US.UTF-8', 17:27:48 INFO - 'LANGUAGE': 'en_US:en', 17:27:48 INFO - 'LOGNAME': 'cltbld', 17:27:48 INFO - 'MAIL': '/var/mail/cltbld', 17:27:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:27:48 INFO - 'MOZ_NO_REMOTE': '1', 17:27:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:27:48 INFO - 'NO_EM_RESTART': '1', 17:27:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:27:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:27:48 INFO - 'PWD': '/builds/slave/test', 17:27:48 INFO - 'SHELL': '/bin/bash', 17:27:48 INFO - 'SHLVL': '1', 17:27:48 INFO - 'TERM': 'linux', 17:27:48 INFO - 'TMOUT': '86400', 17:27:48 INFO - 'USER': 'cltbld', 17:27:48 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:27:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:27:48 INFO - '_': '/tools/buildbot/bin/python'} 17:27:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:27:48 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 17:27:48 INFO - Cleaning up... 17:27:48 INFO - Return code: 0 17:27:48 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 17:27:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:27:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:27:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:48 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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f69dec13f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14ae8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x157a7d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', '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 17:27:48 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>=0.7.1'] in /builds/slave/test/build 17:27:48 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>=0.7.1 17:27:48 INFO - Using env: {'DISPLAY': ':0', 17:27:48 INFO - 'HOME': '/home/cltbld', 17:27:48 INFO - 'LANG': 'en_US.UTF-8', 17:27:48 INFO - 'LANGUAGE': 'en_US:en', 17:27:48 INFO - 'LOGNAME': 'cltbld', 17:27:48 INFO - 'MAIL': '/var/mail/cltbld', 17:27:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:27:48 INFO - 'MOZ_NO_REMOTE': '1', 17:27:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:27:48 INFO - 'NO_EM_RESTART': '1', 17:27:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:27:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:27:48 INFO - 'PWD': '/builds/slave/test', 17:27:48 INFO - 'SHELL': '/bin/bash', 17:27:48 INFO - 'SHLVL': '1', 17:27:48 INFO - 'TERM': 'linux', 17:27:48 INFO - 'TMOUT': '86400', 17:27:48 INFO - 'USER': 'cltbld', 17:27:48 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:27:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:27:48 INFO - '_': '/tools/buildbot/bin/python'} 17:27:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:27:49 INFO - Downloading/unpacking psutil>=0.7.1 17:27:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:27:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:27:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:27:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:27:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:27:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:27:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 17:27:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:27:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:27:51 INFO - Installing collected packages: psutil 17:27:51 INFO - Running setup.py install for psutil 17:27:51 INFO - building 'psutil._psutil_linux' extension 17:27:51 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 17:27:51 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 17:27:51 INFO - building 'psutil._psutil_posix' extension 17:27:51 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 17:27:51 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 17:27:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:27:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:27:51 INFO - Successfully installed psutil 17:27:51 INFO - Cleaning up... 17:27:51 INFO - Return code: 0 17:27:51 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 17:27:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:27:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:27:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:51 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.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f69dec13f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14ae8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x157a7d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', '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 17:27:51 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.0.0'] in /builds/slave/test/build 17:27:51 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.0.0 17:27:51 INFO - Using env: {'DISPLAY': ':0', 17:27:51 INFO - 'HOME': '/home/cltbld', 17:27:51 INFO - 'LANG': 'en_US.UTF-8', 17:27:51 INFO - 'LANGUAGE': 'en_US:en', 17:27:51 INFO - 'LOGNAME': 'cltbld', 17:27:51 INFO - 'MAIL': '/var/mail/cltbld', 17:27:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:27:51 INFO - 'MOZ_NO_REMOTE': '1', 17:27:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:27:51 INFO - 'NO_EM_RESTART': '1', 17:27:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:27:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:27:51 INFO - 'PWD': '/builds/slave/test', 17:27:51 INFO - 'SHELL': '/bin/bash', 17:27:51 INFO - 'SHLVL': '1', 17:27:51 INFO - 'TERM': 'linux', 17:27:51 INFO - 'TMOUT': '86400', 17:27:51 INFO - 'USER': 'cltbld', 17:27:51 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:27:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:27:51 INFO - '_': '/tools/buildbot/bin/python'} 17:27:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:27:51 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 17:27:51 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 17:27:51 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 17:27:51 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 17:27:51 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 17:27:51 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 17:27:51 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 17:27:53 INFO - Downloading mozsystemmonitor-0.0.tar.gz 17:27:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:27:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 17:27:53 INFO - Installing collected packages: mozsystemmonitor 17:27:53 INFO - Running setup.py install for mozsystemmonitor 17:27:53 INFO - Successfully installed mozsystemmonitor 17:27:53 INFO - Cleaning up... 17:27:53 INFO - Return code: 0 17:27:53 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 17:27:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:27:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:27:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:53 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 0x7f69dec13f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14ae8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x157a7d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', '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 17:27:53 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 17:27:53 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 17:27:53 INFO - Using env: {'DISPLAY': ':0', 17:27:53 INFO - 'HOME': '/home/cltbld', 17:27:53 INFO - 'LANG': 'en_US.UTF-8', 17:27:53 INFO - 'LANGUAGE': 'en_US:en', 17:27:53 INFO - 'LOGNAME': 'cltbld', 17:27:53 INFO - 'MAIL': '/var/mail/cltbld', 17:27:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:27:53 INFO - 'MOZ_NO_REMOTE': '1', 17:27:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:27:53 INFO - 'NO_EM_RESTART': '1', 17:27:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:27:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:27:53 INFO - 'PWD': '/builds/slave/test', 17:27:53 INFO - 'SHELL': '/bin/bash', 17:27:53 INFO - 'SHLVL': '1', 17:27:53 INFO - 'TERM': 'linux', 17:27:53 INFO - 'TMOUT': '86400', 17:27:53 INFO - 'USER': 'cltbld', 17:27:53 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:27:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:27:53 INFO - '_': '/tools/buildbot/bin/python'} 17:27:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:27:54 INFO - Downloading/unpacking blobuploader==1.2.4 17:27:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:27:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:27:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:27:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:27:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:27:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:27:55 INFO - Downloading blobuploader-1.2.4.tar.gz 17:27:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:27:56 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:27:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:27:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:27:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:27:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:27:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:27:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:27:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 17:27:56 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:27:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:27:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:27:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:27:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:27:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:27:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:27:56 INFO - Downloading docopt-0.6.1.tar.gz 17:27:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 17:27:56 INFO - Installing collected packages: blobuploader, requests, docopt 17:27:56 INFO - Running setup.py install for blobuploader 17:27:56 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:27:56 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 17:27:56 INFO - Running setup.py install for requests 17:27:57 INFO - Running setup.py install for docopt 17:27:57 INFO - Successfully installed blobuploader requests docopt 17:27:57 INFO - Cleaning up... 17:27:57 INFO - Return code: 0 17:27:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:27:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:27:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:27:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:27:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:27:57 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 0x7f69dec13f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14ae8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x157a7d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', '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 17:27:57 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 17:27:57 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 17:27:57 INFO - Using env: {'DISPLAY': ':0', 17:27:57 INFO - 'HOME': '/home/cltbld', 17:27:57 INFO - 'LANG': 'en_US.UTF-8', 17:27:57 INFO - 'LANGUAGE': 'en_US:en', 17:27:57 INFO - 'LOGNAME': 'cltbld', 17:27:57 INFO - 'MAIL': '/var/mail/cltbld', 17:27:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:27:57 INFO - 'MOZ_NO_REMOTE': '1', 17:27:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:27:57 INFO - 'NO_EM_RESTART': '1', 17:27:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:27:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:27:57 INFO - 'PWD': '/builds/slave/test', 17:27:57 INFO - 'SHELL': '/bin/bash', 17:27:57 INFO - 'SHLVL': '1', 17:27:57 INFO - 'TERM': 'linux', 17:27:57 INFO - 'TMOUT': '86400', 17:27:57 INFO - 'USER': 'cltbld', 17:27:57 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:27:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:27:57 INFO - '_': '/tools/buildbot/bin/python'} 17:27:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:27:57 INFO - Running setup.py (path:/tmp/pip-QDw6e_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:27:57 INFO - Running setup.py (path:/tmp/pip-ThwlqC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:27:57 INFO - Running setup.py (path:/tmp/pip-tyi1ba-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:27:57 INFO - Running setup.py (path:/tmp/pip-yzO4P8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:27:57 INFO - Running setup.py (path:/tmp/pip-CHtiLD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:27:57 INFO - Running setup.py (path:/tmp/pip-LNICEp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:27:57 INFO - Running setup.py (path:/tmp/pip-wKI_Ag-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:27:58 INFO - Running setup.py (path:/tmp/pip-3l_hJC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:27:58 INFO - Running setup.py (path:/tmp/pip-blYQFx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:27:58 INFO - Running setup.py (path:/tmp/pip-aIU2W5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:27:58 INFO - Running setup.py (path:/tmp/pip-n4QEBW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:27:58 INFO - Running setup.py (path:/tmp/pip-afJolX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:27:58 INFO - Running setup.py (path:/tmp/pip-lOwMh7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:27:58 INFO - Running setup.py (path:/tmp/pip-uh8XHv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:27:58 INFO - Running setup.py (path:/tmp/pip-WRxPKK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:27:58 INFO - Running setup.py (path:/tmp/pip-1iG7wj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:27:58 INFO - Running setup.py (path:/tmp/pip-PaCQBg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:27:58 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:27:58 INFO - Running setup.py install for manifestparser 17:27:58 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 17:27:58 INFO - Running setup.py install for mozcrash 17:27:58 INFO - Running setup.py install for mozdebug 17:27:59 INFO - Running setup.py install for mozdevice 17:27:59 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Installing dm script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Running setup.py install for mozfile 17:27:59 INFO - Running setup.py install for mozhttpd 17:27:59 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Running setup.py install for mozinfo 17:27:59 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Running setup.py install for mozInstall 17:27:59 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Running setup.py install for mozleak 17:27:59 INFO - Running setup.py install for mozlog 17:27:59 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Running setup.py install for moznetwork 17:27:59 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 17:27:59 INFO - Running setup.py install for mozprocess 17:28:00 INFO - Running setup.py install for mozprofile 17:28:00 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 17:28:00 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 17:28:00 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 17:28:00 INFO - Running setup.py install for mozrunner 17:28:00 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 17:28:00 INFO - Running setup.py install for mozscreenshot 17:28:00 INFO - Running setup.py install for moztest 17:28:00 INFO - Running setup.py install for mozversion 17:28:00 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 17:28:00 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:28:00 INFO - Cleaning up... 17:28:00 INFO - Return code: 0 17:28:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:28:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:00 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 0x7f69dec13f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14ae8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x157a7d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', '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 17:28:00 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 17:28:00 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 17:28:00 INFO - Using env: {'DISPLAY': ':0', 17:28:00 INFO - 'HOME': '/home/cltbld', 17:28:00 INFO - 'LANG': 'en_US.UTF-8', 17:28:00 INFO - 'LANGUAGE': 'en_US:en', 17:28:00 INFO - 'LOGNAME': 'cltbld', 17:28:00 INFO - 'MAIL': '/var/mail/cltbld', 17:28:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:00 INFO - 'MOZ_NO_REMOTE': '1', 17:28:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:28:00 INFO - 'NO_EM_RESTART': '1', 17:28:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:28:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:00 INFO - 'PWD': '/builds/slave/test', 17:28:00 INFO - 'SHELL': '/bin/bash', 17:28:00 INFO - 'SHLVL': '1', 17:28:00 INFO - 'TERM': 'linux', 17:28:00 INFO - 'TMOUT': '86400', 17:28:00 INFO - 'USER': 'cltbld', 17:28:00 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:28:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:00 INFO - '_': '/tools/buildbot/bin/python'} 17:28:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 17:28:00 INFO - Running setup.py (path:/tmp/pip-zRsDsO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 17:28:00 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)) 17:28:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 17:28:00 INFO - Running setup.py (path:/tmp/pip-wsHHhx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 17:28:00 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:28:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 17:28:00 INFO - Running setup.py (path:/tmp/pip-X2piqW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 17:28:00 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)) 17:28:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 17:28:01 INFO - Running setup.py (path:/tmp/pip-qGRP3L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 17:28:01 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 17:28:01 INFO - Running setup.py (path:/tmp/pip-FT851T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 17:28:01 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 17:28:01 INFO - Running setup.py (path:/tmp/pip-d4fFBN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 17:28:01 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 17:28:01 INFO - Running setup.py (path:/tmp/pip-II11Wy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 17:28:01 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 17:28:01 INFO - Running setup.py (path:/tmp/pip-kfqI5c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 17:28:01 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 17:28:01 INFO - Running setup.py (path:/tmp/pip-4XOGID-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 17:28:01 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 17:28:01 INFO - Running setup.py (path:/tmp/pip-KJIhWf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 17:28:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 17:28:01 INFO - Running setup.py (path:/tmp/pip-XKP0t7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 17:28:01 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 17:28:01 INFO - Running setup.py (path:/tmp/pip-PXdeDY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 17:28:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 17:28:01 INFO - Running setup.py (path:/tmp/pip-UyZgHr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 17:28:01 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 17:28:01 INFO - Running setup.py (path:/tmp/pip-71YsYo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 17:28:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 17:28:01 INFO - Running setup.py (path:/tmp/pip-KpR4Ka-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 17:28:01 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)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 17:28:01 INFO - Running setup.py (path:/tmp/pip-GsgUoZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 17:28:01 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 17:28:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 17:28:01 INFO - Running setup.py (path:/tmp/pip-i1g6bG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 17:28:01 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)) 17:28:01 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:28:02 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 17:28:02 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)) 17:28:02 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)) 17:28:02 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)) 17:28:02 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 17:28:02 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 17:28:02 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 17:28:02 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 17:28:02 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 17:28:02 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 17:28:02 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 17:28:03 INFO - Downloading blessings-1.6.tar.gz 17:28:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 17:28:03 INFO - Installing collected packages: blessings 17:28:03 INFO - Running setup.py install for blessings 17:28:04 INFO - Successfully installed blessings 17:28:04 INFO - Cleaning up... 17:28:04 INFO - Return code: 0 17:28:04 INFO - Done creating virtualenv /builds/slave/test/build/venv. 17:28:04 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:28:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:28:04 INFO - Reading from file tmpfile_stdout 17:28:04 INFO - Current package versions: 17:28:04 INFO - argparse == 1.2.1 17:28:04 INFO - blessings == 1.6 17:28:04 INFO - blobuploader == 1.2.4 17:28:04 INFO - docopt == 0.6.1 17:28:04 INFO - manifestparser == 1.1 17:28:04 INFO - mozInstall == 1.12 17:28:04 INFO - mozcrash == 0.17 17:28:04 INFO - mozdebug == 0.1 17:28:04 INFO - mozdevice == 0.48 17:28:04 INFO - mozfile == 1.2 17:28:04 INFO - mozhttpd == 0.7 17:28:04 INFO - mozinfo == 0.9 17:28:04 INFO - mozleak == 0.1 17:28:04 INFO - mozlog == 3.1 17:28:04 INFO - moznetwork == 0.27 17:28:04 INFO - mozprocess == 0.22 17:28:04 INFO - mozprofile == 0.28 17:28:04 INFO - mozrunner == 6.11 17:28:04 INFO - mozscreenshot == 0.1 17:28:04 INFO - mozsystemmonitor == 0.0 17:28:04 INFO - moztest == 0.7 17:28:04 INFO - mozversion == 1.4 17:28:04 INFO - psutil == 3.1.1 17:28:04 INFO - requests == 1.2.3 17:28:04 INFO - wsgiref == 0.1.2 17:28:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 17:28:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:04 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 0x7f69dec13f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14ae8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x157a7d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', '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 17:28:04 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 17:28:04 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 17:28:04 INFO - Using env: {'DISPLAY': ':0', 17:28:04 INFO - 'HOME': '/home/cltbld', 17:28:04 INFO - 'LANG': 'en_US.UTF-8', 17:28:04 INFO - 'LANGUAGE': 'en_US:en', 17:28:04 INFO - 'LOGNAME': 'cltbld', 17:28:04 INFO - 'MAIL': '/var/mail/cltbld', 17:28:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:04 INFO - 'MOZ_NO_REMOTE': '1', 17:28:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:28:04 INFO - 'NO_EM_RESTART': '1', 17:28:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:28:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:04 INFO - 'PWD': '/builds/slave/test', 17:28:04 INFO - 'SHELL': '/bin/bash', 17:28:04 INFO - 'SHLVL': '1', 17:28:04 INFO - 'TERM': 'linux', 17:28:04 INFO - 'TMOUT': '86400', 17:28:04 INFO - 'USER': 'cltbld', 17:28:04 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:28:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:04 INFO - '_': '/tools/buildbot/bin/python'} 17:28:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:04 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)) 17:28:04 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)) 17:28:04 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)) 17:28:04 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)) 17:28:04 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)) 17:28:04 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)) 17:28:04 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)) 17:28:04 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)) 17:28:04 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)) 17:28:04 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)) 17:28:04 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)) 17:28:04 INFO - Cleaning up... 17:28:04 INFO - Return code: 0 17:28:04 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 17:28:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:04 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 0x7f69dec13f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14ae8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x157a7d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', '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 17:28:04 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 17:28:04 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 17:28:04 INFO - Using env: {'DISPLAY': ':0', 17:28:04 INFO - 'HOME': '/home/cltbld', 17:28:04 INFO - 'LANG': 'en_US.UTF-8', 17:28:04 INFO - 'LANGUAGE': 'en_US:en', 17:28:04 INFO - 'LOGNAME': 'cltbld', 17:28:04 INFO - 'MAIL': '/var/mail/cltbld', 17:28:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:04 INFO - 'MOZ_NO_REMOTE': '1', 17:28:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:28:04 INFO - 'NO_EM_RESTART': '1', 17:28:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:28:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:04 INFO - 'PWD': '/builds/slave/test', 17:28:04 INFO - 'SHELL': '/bin/bash', 17:28:04 INFO - 'SHLVL': '1', 17:28:04 INFO - 'TERM': 'linux', 17:28:04 INFO - 'TMOUT': '86400', 17:28:04 INFO - 'USER': 'cltbld', 17:28:04 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:28:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:04 INFO - '_': '/tools/buildbot/bin/python'} 17:28:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:04 INFO - Downloading/unpacking jsonschema 17:28:04 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 17:28:04 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 17:28:04 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 17:28:04 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 17:28:04 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 17:28:04 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 17:28:06 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:28:06 INFO - Downloading/unpacking functools32 (from jsonschema) 17:28:06 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 17:28:06 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 17:28:06 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 17:28:06 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 17:28:06 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 17:28:06 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 17:28:06 INFO - Downloading functools32-3.2.3-2.tar.gz 17:28:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 17:28:06 INFO - warning: no files found matching '*.txt' 17:28:06 INFO - no previously-included directories found matching 'build' 17:28:06 INFO - no previously-included directories found matching 'dist' 17:28:06 INFO - no previously-included directories found matching '.git*' 17:28:06 INFO - Installing collected packages: jsonschema, functools32 17:28:07 INFO - Running setup.py install for functools32 17:28:07 INFO - warning: no files found matching '*.txt' 17:28:07 INFO - no previously-included directories found matching 'build' 17:28:07 INFO - no previously-included directories found matching 'dist' 17:28:07 INFO - no previously-included directories found matching '.git*' 17:28:07 INFO - Successfully installed jsonschema functools32 17:28:07 INFO - Cleaning up... 17:28:07 INFO - Return code: 0 17:28:07 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 17:28:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:28:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:28:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:28:07 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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f69dec13f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x14ae8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x157a7d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, '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': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', '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 17:28:07 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', 'flake8'] in /builds/slave/test/build 17:28:07 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 flake8 17:28:07 INFO - Using env: {'DISPLAY': ':0', 17:28:07 INFO - 'HOME': '/home/cltbld', 17:28:07 INFO - 'LANG': 'en_US.UTF-8', 17:28:07 INFO - 'LANGUAGE': 'en_US:en', 17:28:07 INFO - 'LOGNAME': 'cltbld', 17:28:07 INFO - 'MAIL': '/var/mail/cltbld', 17:28:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:07 INFO - 'MOZ_NO_REMOTE': '1', 17:28:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:28:07 INFO - 'NO_EM_RESTART': '1', 17:28:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:28:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:07 INFO - 'PWD': '/builds/slave/test', 17:28:07 INFO - 'SHELL': '/bin/bash', 17:28:07 INFO - 'SHLVL': '1', 17:28:07 INFO - 'TERM': 'linux', 17:28:07 INFO - 'TMOUT': '86400', 17:28:07 INFO - 'USER': 'cltbld', 17:28:07 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:28:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:07 INFO - '_': '/tools/buildbot/bin/python'} 17:28:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:28:07 INFO - Downloading/unpacking flake8 17:28:07 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 17:28:07 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 17:28:07 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 17:28:07 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 17:28:07 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 17:28:07 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 17:28:09 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 17:28:09 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 17:28:09 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 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 17:28:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 17:28:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:28:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:28:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:28:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:28:09 INFO - no previously-included directories found matching 'docs/_build' 17:28:09 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 17:28:10 INFO - Running setup.py install for pep8 17:28:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:28:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:28:10 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:28:10 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:28:10 INFO - no previously-included directories found matching 'docs/_build' 17:28:10 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 17:28:10 INFO - Successfully installed flake8 mccabe pyflakes pep8 17:28:10 INFO - Cleaning up... 17:28:10 INFO - Return code: 0 17:28:10 INFO - Running post-action listener: _resource_record_post_action 17:28:10 INFO - Running post-action listener: _start_resource_monitoring 17:28:10 INFO - Starting resource monitoring. 17:28:10 INFO - ##### 17:28:10 INFO - ##### Running install step. 17:28:10 INFO - ##### 17:28:10 INFO - Running pre-action listener: _resource_record_pre_action 17:28:10 INFO - Running main action method: install 17:28:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 17:28:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 17:28:10 INFO - Reading from file tmpfile_stdout 17:28:10 INFO - Detecting whether we're running mozinstall >=1.0... 17:28:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 17:28:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 17:28:10 INFO - Reading from file tmpfile_stdout 17:28:10 INFO - Output received: 17:28:10 INFO - Usage: mozinstall [options] installer 17:28:10 INFO - Options: 17:28:10 INFO - -h, --help show this help message and exit 17:28:10 INFO - -d DEST, --destination=DEST 17:28:10 INFO - Directory to install application into. [default: 17:28:10 INFO - "/builds/slave/test"] 17:28:10 INFO - --app=APP Application being installed. [default: firefox] 17:28:10 INFO - mkdir: /builds/slave/test/build/application 17:28:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 17:28:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 17:28:26 INFO - Reading from file tmpfile_stdout 17:28:26 INFO - Output received: 17:28:26 INFO - /builds/slave/test/build/application/firefox/firefox 17:28:26 INFO - Running post-action listener: _resource_record_post_action 17:28:26 INFO - ##### 17:28:26 INFO - ##### Running run-tests step. 17:28:26 INFO - ##### 17:28:26 INFO - Running pre-action listener: _resource_record_pre_action 17:28:26 INFO - Running main action method: run_tests 17:28:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 17:28:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 17:28:26 INFO - Python 2.7.3 17:28:26 INFO - Return code: 0 17:28:26 INFO - grabbing minidump binary from tooltool 17:28:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:28:26 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1609640>, '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 0x160a540>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x160a9d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 17:28:26 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 17:28:26 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 17:28:26 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:28:26 INFO - Return code: 0 17:28:26 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 17:28:26 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 17:28:26 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 17:28:26 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 17:28:26 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 17:28:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 17:28:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 17:28:27 INFO - Return code: 0 17:28:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 17:28:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-002 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 17:28:27 INFO - Using env: {'DISPLAY': ':0', 17:28:27 INFO - 'HOME': '/home/cltbld', 17:28:27 INFO - 'LANG': 'en_US.UTF-8', 17:28:27 INFO - 'LANGUAGE': 'en_US:en', 17:28:27 INFO - 'LOGNAME': 'cltbld', 17:28:27 INFO - 'MAIL': '/var/mail/cltbld', 17:28:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 17:28:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 17:28:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:28:27 INFO - 'MOZ_NO_REMOTE': '1', 17:28:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 17:28:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:28:27 INFO - 'NO_EM_RESTART': '1', 17:28:27 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:28:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 17:28:27 INFO - 'PWD': '/builds/slave/test', 17:28:27 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 17:28:27 INFO - 'SHELL': '/bin/bash', 17:28:27 INFO - 'SHLVL': '1', 17:28:27 INFO - 'TERM': 'linux', 17:28:27 INFO - 'TMOUT': '86400', 17:28:27 INFO - 'USER': 'cltbld', 17:28:27 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415', 17:28:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:28:27 INFO - '_': '/tools/buildbot/bin/python'} 17:28:27 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 17:28:27 INFO - mozversion application_buildid: 20160429160640 17:28:27 INFO - mozversion application_changeset: 8471d2d75bf43d0ad1c2cb069eb331e481a8d01a 17:28:27 INFO - mozversion application_display_name: Nightly 17:28:27 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:28:27 INFO - mozversion application_name: Firefox 17:28:27 INFO - mozversion application_remotingname: firefox 17:28:27 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 17:28:27 INFO - mozversion application_vendor: Mozilla 17:28:27 INFO - mozversion application_version: 49.0a1 17:28:27 INFO - mozversion platform_buildid: 20160429160640 17:28:27 INFO - mozversion platform_changeset: 8471d2d75bf43d0ad1c2cb069eb331e481a8d01a 17:28:27 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 17:28:27 INFO - mozversion platform_version: 49.0a1 17:28:27 INFO - using testdate: 1461976107 17:28:27 INFO - actual date: 1461976107 17:28:27 INFO - starting webserver on 'localhost:40546' 17:28:27 INFO - SUITE-START | Running 2 tests 17:28:27 INFO - TEST-START | dromaeo_css 17:28:27 INFO - operating with platform_type : linux_ 17:28:27 INFO - Initialising browser for dromaeo_css test... 17:28:27 INFO - TEST-INFO | started process 19735 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKJHuXk/profile http://localhost:40546/getInfo.html) 17:28:31 INFO - PROCESS | 19735 | __metrics Screen width/height:1600/1200 17:28:31 INFO - PROCESS | 19735 | colorDepth:24 17:28:31 INFO - PROCESS | 19735 | Browser inner width/height: 1024/697 17:28:31 INFO - PROCESS | 19735 | __metrics 17:28:32 ERROR - PROCESS | 19735 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 17:28:33 INFO - TEST-INFO | 19735: exit 0 17:28:33 INFO - Browser initialized. 17:28:33 INFO - Running cycle 1/1 for dromaeo_css test... 17:28:33 INFO - TEST-INFO | started process 19818 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKJHuXk/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:28:45 INFO - PROCESS | 19818 | RSS: Main: 156483584 17:28:45 INFO - PROCESS | 19818 | 17:29:36 INFO - PROCESS | 19818 | 1461976176850 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 17:31:48 INFO - PROCESS | 19818 | Cycle 1(1): loaded http://localhost:40546/tests/dromaeo/cssquery-dojo.html (next: http://localhost:40546/tests/dromaeo/cssquery-ext.html) 17:31:49 INFO - PROCESS | 19818 | RSS: Main: 257011712 17:31:49 INFO - PROCESS | 19818 | 17:34:51 INFO - PROCESS | 19818 | Cycle 1(1): loaded http://localhost:40546/tests/dromaeo/cssquery-ext.html (next: http://localhost:40546/tests/dromaeo/cssquery-jquery.html) 17:34:52 INFO - PROCESS | 19818 | RSS: Main: 229613568 17:34:52 INFO - PROCESS | 19818 | 17:37:54 INFO - PROCESS | 19818 | Cycle 1(1): loaded http://localhost:40546/tests/dromaeo/cssquery-jquery.html (next: http://localhost:40546/tests/dromaeo/cssquery-mootools.html) 17:37:55 INFO - PROCESS | 19818 | RSS: Main: 232607744 17:37:55 INFO - PROCESS | 19818 | 17:40:57 INFO - PROCESS | 19818 | Cycle 1(1): loaded http://localhost:40546/tests/dromaeo/cssquery-mootools.html (next: http://localhost:40546/tests/dromaeo/cssquery-prototype.html) 17:40:57 INFO - PROCESS | 19818 | RSS: Main: 231829504 17:40:57 INFO - PROCESS | 19818 | 17:44:00 INFO - PROCESS | 19818 | Cycle 1(1): loaded http://localhost:40546/tests/dromaeo/cssquery-prototype.html (next: http://localhost:40546/tests/dromaeo/cssquery-yui.html) 17:44:01 INFO - PROCESS | 19818 | RSS: Main: 220295168 17:44:01 INFO - PROCESS | 19818 | 17:47:04 INFO - PROCESS | 19818 | Cycle 1(1): loaded http://localhost:40546/tests/dromaeo/cssquery-yui.html (next: http://localhost:40546/tests/dromaeo/cssquery-dojo.html) 17:47:04 INFO - PROCESS | 19818 | RSS: Main: 243568640 17:47:04 INFO - PROCESS | 19818 | 17:47:04 INFO - PROCESS | 19818 | __start_tp_report 17:47:04 INFO - PROCESS | 19818 | _x_x_mozilla_page_load 17:47:04 INFO - PROCESS | 19818 | _x_x_mozilla_page_load_details 17:47:04 INFO - PROCESS | 19818 | |i|pagename|runs| 17:47:04 INFO - PROCESS | 19818 | |0;dojo.html;2555.619965218782;2623.317937336293;2632.6972398174194;2647.351398907268;2661.973380266198;4493.528179541142;4605;4628.699134556256;4631.953680463199;4647.093816705744;4589.931151032737;4599.7010194337345;4613.215753321935;4672.976635116828;4679.251319788835;4195.832166713328;4218.346156345771;4237.152569486115;4265.7014009019385;4404.625606823424;4347.8260869565165;4354.978225108885;4361.6510679145595;4380.6495480361655;4407.559244075599;4143.96400899775;4232.9153416931795;4233.047564298008;4239.046214601721;4286.014216730138;4186.727862688916;4224.8732538023905;4233.216854881856;4234.195502854479;4280.336547835091;4262.339337402707;4303.139372125556;4303.139372125587;4327.545607711177;4328.199283132631;4419.712718673308;4514.706544074625;4578.336141259499;4582.679212455129;4591.380163677894;4942.357493525818;4945.67853089548;4960.255961605788;4965.428975667808;4970.552650261494;4979.526944940225;4988.65079444439;5003.224500202475;5006.173981293082;5035.471275516092;4533.863984080483;4601.539846015438;4652.906941861143;4687.296905464208;4688.671792974459;5106.821261255838;5114.079465696211;5126.974365128151;5131.897362052738;5176.611754118456;4727.456342520654;4907.730074845917;4910.361652985089;4916.729579873141;4916.901661966741;4933.703977761345;5019.648624596316;5030.044291584587;5036.06832735945;5040.017196646619;4883.633727470454;4906.828261010919;4909.337239472697;4913.508649135058;4958.8512344629;4879.1461494238365;4888.3581731610175;4890.021995600894;4895.118878601815;4938.678985865908;4150.418941348214;4218.430511880857;4222.514410842731;4223.429836971969;4224.852130175429;3681.318955993096;3728.459373390843;3746.1758413149064;3761.736678432538;3782.791946442972;4277.358396240589;4293.892652683646;4297.5702429756775;4302.612764851116;4339.414179085783;4914.5822605078965;4953.578945789576;4955.801767929314;4957.90084198314;4988.90022199554;4203.747775133441;4288.871333859989;4342.478902531717;4371.868843934687;4395.055063161436;4442.800073996613;4454.532274111237;4456.064226512469;4457.1308594823695;4487.6634252431195;4515.90968180628;4636.559526844944;4637.86086417408;4641.280601506772;4643.95356046442;4968.478309777566;5020.799168033238;5021.171506701499;5036.722980235975;5070.6957582545165;4664.416947881515;4685.953140468688;4688.695234809727;4690.179218636793;4703.435587729495;4819.180739274402;4858.1012512685265;4882.170031094652;4900.509949005071;4951;4940.950590494049;4962.602991760578;4964.602831773522;4965.751712414292;5015.548600625962;4824.0834241494;4824.903501930012;4827.831025914216;4831.0820944020525;4876.244182151772;4721.362616046789;4734.834280800155;4821.5178482151505;4821.710697358029;4875.024995001085;4726.881827954328;4754.786034628381;4765.046990601824;4783.689060211075;4802.807887684593;4772.689775164603;4782.187028205283;4785.282207668877;4858;4873.805047798049;4665.5101214372;4705.988212534322;4709.646776491708;4741.383620129361;4804.519548045308 17:47:04 INFO - PROCESS | 19818 | |1;ext.html;566.7308028686374;602.8884656338578;606.6329870428387;611.2909025530386;622.0637939900449;33531.83234083829;33658.83170584147;34596.48105278423;34623.13442163947;35585.82207088964;36359.454608180895;36912.446313305256;36970.44544331837;37214.62785372145;37256.81371593145;7240.348368646821;7367.742129025485;7514.924850751505;7532.058492688414;9397.248220142406;9506.287028472892;9683.661071862487;9693.563789629483;9697.612095516171;9700.223982081416;9598.904010959906;9726.805463890718;9734.026597340244;9734.51327433629;9736.464494452803;9444.527773611326;9525.904740952572;9528.38065525742;9555.569999350046;9556.713298601053;9786.902130978742;9900.950495247549;9906.504674766305;9912.35569687968;9918.652847150388;38470.23059538822;38953.61046389528;39020.41469377962;39023.219535609416;39048;3101.720845123927;3108.2074071111947;3128.2335827722127;3154.5899033125547;3170.4134735074085;29262;29992.55011174834;29997.250068748457;30039.837849455907;30888.0733577993;3149.889753858604;3174.5238214267815;3213.8714451421915;3221.4040402525607;3274.492453669685;250451;251922.74038629874;252152;252245;252940;52896;53074.73462632662;53199;53229.46770532245;53248.870045198535;56427.435725642215;56722.43277567254;56723.43276567264;56735;56761.43238567644;14549;14850.183239921693;14876.256187190813;14901.478448254258;14947.878909081863;9977;10886.510107045202;11111.222214444912;11113.388763618079;11122.49948752308;15547.37810487568;15628.655701644844;15657.373705051898;15695.764563531557;15799.526014219591;5935.376785437553;6110.663913484801;6141.169462920661;6267.467265282411;6339.904901426482;850.8170743290223;884.712468447757;917.5045475443186;929.0384452092052;1046.0794500839213;27919.581206281517;28334.149975500768;28394.43211135766;28751.712482875322;28919;978.3933960944117;989.7525618595351;995.7012896131132;1054.2672842374477;1094.7044298039484;15126.546203613909;15307.311170997333;15326.080435173924;15326.540203793904;15449.31825178504;348809;354823;355210;356391;356772;48204.758976204896;49467.257991130165;49509.75245123752;49530;49570.25644615333;1060.3531845574194;1185.6424394068742;1221.065884598283;1223.3760782001243;1230.1819290171936;26224.60663090017;27506.312342191606;27662.446751064464;28046.85976570104;28219;40165.397519036655;41110;41161.58838411578;41282.793586031876;41317.1736565273;233576;239077;239892;239948;243046;27401.45197096087;33791.49312760261;33838.15404614806;33868.3226335467;34022.14944626404;37862;38301.233975320894;39043.219135616564;39564.80217598894;39789.40315895206;35310.29379412449;36601.45097823588;36970.630293697795;37040.44439333466;37365.626343737305;36117.45823812697;36415.81792091022;36765.81617091897;36838.63161368352;36986.26027479489;35117;35981.28037439289;36228.63771362253;36508;36932.26135477329;32246.19384515312;32559.674403255663;33040.33919321648;33277;33530.49704254487;25142.69264748207;25305.620415694146;25618.23145305644;25829.22512324633;26006 17:47:04 INFO - PROCESS | 19818 | |2;jquery.html;377.70161572357836;378.4777007729333;379;379.0920744816165;388.99222015559707;15541.300641471133;16244.106574138417;16644.08457534835;16666.1666916654;16693.499195024153;16105.194740263;16118.274677639534;16933.06868122253;16955.91522042391;16964.915175424107;5051.444341122474;5217.791288348461;5227.372715274153;5249.635094875341;5253.422123566424;3631.2918980798754;3773.056735816046;4049.817758200888;5785.479306862381;6102.389761023906;5997.820065398045;6036;6047.334793172748;6065.939340606604;6071.058985857199;5954.97022514889;6006.8498287542725;6009.789657361993;6014.188084608566;6022.126791615213;3383.2387712764676;5034.723090230036;5143.665661732013;5303.178007408857;5304.25740396341;18962.24151033957;19103.33138340165;19113.90443047776;19769.703454448194;20483.795162048486;2097.024883429213;2184.90167942443;2409.6746939163163;2507.4358269389422;2530.595104783226;12278.570250041206;12611.306378149198;12793.808092878615;12888.871111288861;13304.467821287233;1739.6085880676874;1795.8832675876156;1805.9548511287323;1839.6504664113775;1848.122141982561;67985.32014679839;70441.64779176122;70659.64670176667;70666.64666676686;70949.64525177392;9436.386634868848;9556.331056825955;9720.708378748648;9771.657991970247;9801.117899388946;13597.184168949894;13677.931610341884;13716.177029378268;13731.931340343235;13751.037427379988;7422.517536360119;7443.7766866993;7454.925450745423;7602.8099297518;7682.462227644123;7126.750563730245;7169.856602867913;7184.137903451619;7297.562146271241;7330.8900366494545;6078.908816367758;6135.128785720398;6163.137160797492;6203.8138855834395;6295.905561416583;1646.7941507311587;1717.5706073481629;1748.4579780268157;1775.5561109722569;1825.8813177143443;845.4420082745359;853.2320911179987;893.9942564614809;897.6274845938863;908.3051465628799;15832.366705331659;16363.345466181458;16721.749173762404;18278.268869245083;18411.539711507052;855.7090589199702;859.4284800607651;896.1799953043023;905.7509184974185;916.2029034739686;7305.671244793997;10213.247445447469;10421.374717516974;10422.635207767691;10459.431085337108;422182;426211;426907;427463;430639;75334.62332688412;85043;85317.57341213254;87574;87662.56168719243;941.5527624378366;951.0632027452954;975.7804493988938;983.7196399026386;985.4973963278779;15336.156511391535;15403;15465.613359666098;15594.766078509057;15904.363825446853;35378.46932295966;36327.63672363242;36812.815935920145;36876.446853296686;37004.62995370012;49796.50203498064;50129.74935125447;51833;51834.74082629563;52062;7093.609851458219;7319.194888562361;7339.339459448675;7419.9258007421395;7473.878918162101;9570.47362395075;10811.13510919109;10835.349879007284;10984.451824591823;11042.779144417227;8609.784755381166;8806.427582207136;8904.732858014011;9149.77125571866;9337.813243735223;9470.289728270269;9684.854727178958;9732.951335243279;9763.804723905625;9777.273315610826;8875.423097498642;8981.910180898369;9033.683821066232;9034.14175653312;9240.95379523098;7341.889871651822;7486.326230639269;7510;7515.849683006419;7593.202713714981;7220.0613920190035;8895.332850036144;9249.16757491829;9283.210927071004;9401.905980940102 17:47:04 INFO - PROCESS | 19818 | |3;mootools.html;1257.9748405031905;1405.8945579081571;1423.5444657709531;1511.32745928062;1711.1187738314761;7258.491905566606;7513.511621744583;7541.472096953223;7551.622418879061;7552.093748750144;7314.305141011609;7471.626418679071;7491.363234125092;7492.175860655324;7493.625318734069;2154.246013895136;2186.169255682846;2186.486175748698;2188.3763127508664;2188.6498160294354;2049.5388537579074;2060.7115003899467;2155.051777218027;2167.566486702658;2168.1002384010617;2139.5399989002362;2191.3206905859156;2197.6154173019736;2198.758136604972;2199.824014078878;2143.6034333648327;2144.774798646143;2145.967810482844;2157.0616781699932;2157.5684863027377;2035.1350675962806;2086.634838903201;2090.592334494774;2091.979080209194;2097.958040839175;7611.1627720950655;7641.541507509512;7699.1146018208065;7700;7884.21157884207;4468.82124715011;4582.152301824173;4588.6099681526775;4602.6548008899135;4615.192341340252;2791.8743656535503;2829.8160619559662;2866.025551312543;2870.1389583125188;2902;901.33301356996;907.668700924158;908.8182363527255;909.8726178335038;922.5940586142076;10476.68569942903;10545.894541054491;10557.260991730582;10586.20603454744;10592.523336449878;3988.12261302513;4053.918921621551;4089.1208390196252;4164.354525048561;4168.937465938014;8429.915700842914;8446.873296900552;8453.450525715809;8462.534560599102;8465.915340846514;4279.893002674958;4323.69734118615;4328.415663885336;4330.610245077958;4335.956640433618;3721.5348081489815;3996.020974861178;4111.157212771374;4140.337545992687;4206.26390381682;3438.346714124308;3440.7591468596956;3514.806685632315;3530.911727206789;3558.1282585766653;1036.0468369100445;1038.444432228754;1040.5161599856103;1051.4795176387584;1064.3826580583243;865.9913400865911;873.6592728835759;881.7354793561906;900.3652425040331;921.7234829551107;5284.7093409862055;5376;5401.459854014567;5577.972110139423;5604.607677462538;378.38701303887876;404.7895094550817;407.74515927545286;407.94696689430776;408.24270977336613;3807.2195199983935;3965.4250133730447;4008.6793056555407;4009.398590211433;4070.2266569351727;9511.57197926095;9722.076402741728;9900.65347712841;9969.451680157661;9981.650642227487;9754.609815607297;9819.214462842956;9826.312158149003;9851.556679949419;9861.704148875402;7219.422446204396;7430.702771889172;7504.737334193277;7520.022397088453;7526.5107767994905;5471.452854714496;5518.42056584069;5545.750441230073;5594.1608758686525;5638.436156384329;8717;8871.068537803438;8945.23965462943;8958.148975847284;8973.641054357753;8903.688370906988;8926.598303076507;8985.910140898508;9188.264938805014;9216.032316606928;5766.94233057664;6160.10678451631;6340.841478963062;6380.904286435614;6518.5111116667385;7143.642817858982;7147.606881621561;7207.531510451804;7212.278772122746;7231.05996220509;6352.491800655844;6535.085088087767;6570.737170513126;6627.734890604322;6683.799486015428;6325.240971083315;6352;6356.141920840627;6446.065320528591;6458.806235812745;6345.777897773556;6386.552941294065;6390.936090639034;6391.8721625566295;6413.679316034273;4471.932921006252;4476.306172543261;4533.863984080483;4623.098495793422;4645.674802763774;4707.529247075265;4792.904141917073;4798.3042458843975;4859.3682821233015;4868.513148685245 17:47:04 INFO - PROCESS | 19818 | |4;prototype.html;292.3801540733645;295.4357177790421;295.6762345231971;299.7976365952982;314.0875755929027;4563.26987681971;4662.626989840813;4715.269133284338;4738.90522189556;4783.952160478399;4545.795439205235;4689.718616882989;4697.224957881954;4702.741349225791;4705.741184234866;3746.662800347982;3751.6060813614586;3755.248950209955;3760.0411894966746;3764.0238874590787;3525.8717210492655;3624.1845584743355;3737.2712321097397;3764.5670747864074;3781.0358358618514;3745.644163804448;3760.2479504099288;3764.3976963685814;3769.5853456119803;3780.092777733352;3726.142987112966;3743.47591337213;3745.277172500639;3764.4729737836724;3780.1683629601443;3363.360961417323;3366;3369.7641165118453;3374.493825926106;3376.9831150844334;4504.414426124616;4508.458984921797;4562.771861406916;4573.977130114361;4586.105709386671;4275.315949448073;4287.421198138242;4298.8393133854;4300.279888044807;4308.332208507655;4888.655619704574;4927.926081108751;4947.975260123712;4949.183384741514;4968.354113965198;3543.724259266662;3608.9278214435562;3638.981805090984;3649.6167902370134;3663.9084022899374;5167.844964651029;5169.844904652867;5170.93162734909;5207.973960130251;5220.216967454874;3720.2745464634677;3741;3743.513343265358;3766.4350347448103;3768.6231376862092;3813.254456791106;3817.4655548223272;3822.8853134406013;3828.69824259753;3838.213166300902;4132.318167502389;4278.807453664593;4286.635635970977;4287.292596721569;4291.0559676871035;4857.635677324144;4952.158133117378;4988.102141614471;4998.6750861193905;5004.099262132851;1307.6992291772945;1336.9799453008213;1362.7070179911366;1386.5216500307379;1386.5563019833558;938.2962777916563;946.2430055955208;957.698325027614;967.5210770668564;970.3062310448064;4611;4635.629149668019;4645.117427688729;4645.349651048856;4650.674452788272;5419.674819510842;5423.945760542423;5425.945740542623;5432.320959880015;5434.83695489136;4482.641388688897;4610.861674149781;4619.976900115478;4622.884427889329;4646.535346465326;2905.825650460979;2909.8254104753782;2922.503174460347;2925.049358958347;2931.1646180838784;5099.719515426613;5109.514596113363;5110.71891045996;5112.105381558213;5130.974345128325;5408.215808707715;5542.806001789918;5560.972195139079;5569.610127291051;5580.358258800209;5007.924881126786;5038.974805125951;5043.293938848564;5050.4697006814495;5054.4692807254705;5361.437049109787;5403.351597808288;5410.323709536308;5417.133258678593;5427.755750991294;5186.677397263674;5288.788448462018;5297.841064768063;5303.496167864201;5317.468253174651;5023.422306434661;5034.672746271481;5035.345405097314;5048.570871475818;5065.721385323843;3898;3901.297766402075;3902.902427439337;3917.2361389529906;3929.017745563609;4875.658703890694;5297.761600728054;5373.919391209057;5389.919151212814;5435.565154787529;4819.662623616313;4970.25446183061;5009.974950125226;5018.222175562793;5020.849374518624;4961.677490963076;4971.627127965345;4985.52637499437;4987.625928055338;4994.101061808909;4680.742559159143;4735.431748190239;4788.569028787426;4911.582515486224;4915.877103072452;4946.304264175961;5019.171836646912;5031.22016087507;5036.496350364934;5049.444561098203;4900.926486102782;4901.754912254444;4906.509349065065;4937.839607692261;4940.827071052496 17:47:04 INFO - PROCESS | 19818 | |5;yui.html;603.8822429626225;641.5348872067755;687.5530904911807;691.7509696509255;708.4367927497639;11108.389038602883;11681.941590292046;11822.822657660143;11997.280163190215;12018.519259229632;10348.896511034887;10539.262251642389;10540.894591054088;10564.788704225912;10582.788344233111;633.7338317906467;769.7960040589248;791.1929831571807;811.2860682599304;811.3995643224031;803.9397045221632;811.2982270336175;812.2851890336525;812.4231795425255;812.6911773526082;851.4593233296839;853.4452605806244;854.8931383577053;856.8843206167181;856.9228769410752;661.6890061671007;807.511455569378;831.3266254333948;845.9154084591553;847.2205570874779;606.7663949379521;606.9241344831896;609.3175643279511;610.795383546508;611.3550204534215;11600.6519804406;11646.883531164665;11654.417279136009;11660;11677.240979336317;11323.20737548372;11376.033037191848;11790.469428875722;12068.155229133965;12243.571474998333;9334.579943902541;9411.858822117674;9465.195458386046;9472;9613.375130616558;3280.950785738216;3329.6836800503916;3357.731381489475;3441.8623255069765;3444.50054742061;40960.795196024126;41581.58418415808;42049.57950420487;42146.789266053784;42428.151436971086;9333.626654933862;9533.38033027865;9552.856707149398;9622.853154522993;9906.801863962824;16648.916755416387;16738;16774.49676509707;16834.831651683573;16852.15739213059;6299.842503937347;6360.618362898241;6490.902636460457;6618.86762264752;6781.898271525931;3432.1076520104452;3456.827158642058;3482.164280572644;3511.367953768295;3536.2220311531423;2776.1255204610484;2815.042885418967;2823.68939416664;2826.462972035348;2828.37775689348;488.83135318315834;499.03436849695953;512.1779543832171;514.2517636838392;517.0976645753185;381.90203165898043;480.41702589966144;486.50619621084627;543.8667526455964;556.4407770190933;7167.641617919083;7245.456590755714;7281.708731650675;7318;7460.253974602496;501.7706618783994;541.8103663717667;560.5963706131579;568.1165787200943;577.9624324418984;3400.247634296855;3480.843362048714;3492.046116106318;3504.859805607798;3512.3853325667906;48114.27828582574;48517.27224091641;49204.75397622989;50340;50661.493385065674;44752.55247447549;44782.32826507605;45227;45919;46247.76876115665;41196.38205426921;41333.58666413297;41538.584614154075;41608;41804.790976044926;6524.6411447368955;6693.230278518033;6748.291429399842;6770.593764374154;6826.146731658543;28232.576511351934;29112.708872911;29143.7085629141;29187.270318242216;29467.410651786417;35033.29933401369;36695.88085012697;37345.253094937405;37456.063598409164;37663.05842353963;8771.868421973548;8836.248918841971;8976.685815996409;9006.59470323824;9209.585568649562;9164.334743256506;9313.767155821159;9322.533873306444;9414.388064775767;9488.95255523718;8858.329240523366;8888.200061994452;9042.231410330196;9117.270618350383;9153.221976132103;8601.655933762579;8725.781855453664;8773.956130219309;8813.074627164055;8874.29005679557;8559.914400855912;8641.95679021626;8730;8748.431351962103;8780.692675756318;7595.506292090997;7664.4634875560405;7692.461527693008;7699.8075048122;8187;7697.807554811175;7953.761387158394;8000.51996880189;8136.308413784658;8236.217559331853 17:47:04 INFO - PROCESS | 19818 | __end_tp_report 17:47:04 INFO - PROCESS | 19818 | __start_cc_report 17:47:04 INFO - PROCESS | 19818 | _x_x_mozilla_cycle_collect,962 17:47:04 INFO - PROCESS | 19818 | __end_cc_report 17:47:04 INFO - PROCESS | 19818 | __startTimestamp1461977224263__endTimestamp 17:47:04 INFO - PROCESS | 19818 | 17:47:04 INFO - PROCESS | 19818 | ------- Summary: start ------- 17:47:04 INFO - PROCESS | 19818 | Number of tests: 6 17:47:04 INFO - PROCESS | 19818 | 17:47:04 INFO - PROCESS | 19818 | [#0] dojo.html Cycles:165 Average:4585.34 Median:4688.67 stddev:471.18 (10.0%) stddev-sans-first:444.91 17:47:04 INFO - PROCESS | 19818 | Values: 2555.6 2623.3 2632.7 2647.4 2662.0 4493.5 4605.0 4628.7 4632.0 4647.1 4589.9 4599.7 4613.2 4673.0 4679.3 4195.8 4218.3 4237.2 4265.7 4404.6 4347.8 4355.0 4361.7 4380.6 4407.6 4144.0 4232.9 4233.0 4239.0 4286.0 4186.7 4224.9 4233.2 4234.2 4280.3 4262.3 4303.1 4303.1 4327.5 4328.2 4419.7 4514.7 4578.3 4582.7 4591.4 4942.4 4945.7 4960.3 4965.4 4970.6 4979.5 4988.7 5003.2 5006.2 5035.5 4533.9 4601.5 4652.9 4687.3 4688.7 5106.8 5114.1 5127.0 5131.9 5176.6 4727.5 4907.7 4910.4 4916.7 4916.9 4933.7 5019.6 5030.0 5036.1 5040.0 4883.6 4906.8 4909.3 4913.5 4958.9 4879.1 4888.4 4890.0 4895.1 4938.7 4150.4 4218.4 4222.5 4223.4 4224.9 3681.3 3728.5 3746.2 3761.7 3782.8 4277.4 4293.9 4297.6 4302.6 4339.4 4914.6 4953.6 4955.8 4957.9 4988.9 4203.7 4288.9 4342.5 4371.9 4395.1 4442.8 4454.5 4456.1 4457.1 4487.7 4515.9 4636.6 4637.9 4641.3 4644.0 4968.5 5020.8 5021.2 5036.7 5070.7 4664.4 4686.0 4688.7 4690.2 4703.4 4819.2 4858.1 4882.2 4900.5 4951.0 4941.0 4962.6 4964.6 4965.8 5015.5 4824.1 4824.9 4827.8 4831.1 4876.2 4721.4 4734.8 4821.5 4821.7 4875.0 4726.9 4754.8 4765.0 4783.7 4802.8 4772.7 4782.2 4785.3 4858.0 4873.8 4665.5 4706.0 4709.6 4741.4 4804.5 17:47:04 INFO - PROCESS | 19818 | 17:47:04 INFO - PROCESS | 19818 | [#1] ext.html Cycles:180 Average:44463.64 Median:36173.05 stddev:75004.99 (207.4%) stddev-sans-first:75142.99 17:47:04 INFO - PROCESS | 19818 | Values: 566.7 602.9 606.6 611.3 622.1 33531.8 33658.8 34596.5 34623.1 35585.8 36359.5 36912.4 36970.4 37214.6 37256.8 7240.3 7367.7 7514.9 7532.1 9397.2 9506.3 9683.7 9693.6 9697.6 9700.2 9598.9 9726.8 9734.0 9734.5 9736.5 9444.5 9525.9 9528.4 9555.6 9556.7 9786.9 9901.0 9906.5 9912.4 9918.7 38470.2 38953.6 39020.4 39023.2 39048.0 3101.7 3108.2 3128.2 3154.6 3170.4 29262.0 29992.6 29997.3 30039.8 30888.1 3149.9 3174.5 3213.9 3221.4 3274.5 250451.0 251922.7 252152.0 252245.0 252940.0 52896.0 53074.7 53199.0 53229.5 53248.9 56427.4 56722.4 56723.4 56735.0 56761.4 14549.0 14850.2 14876.3 14901.5 14947.9 9977.0 10886.5 11111.2 11113.4 11122.5 15547.4 15628.7 15657.4 15695.8 15799.5 5935.4 6110.7 6141.2 6267.5 6339.9 850.8 884.7 917.5 929.0 1046.1 27919.6 28334.1 28394.4 28751.7 28919.0 978.4 989.8 995.7 1054.3 1094.7 15126.5 15307.3 15326.1 15326.5 15449.3 348809.0 354823.0 355210.0 356391.0 356772.0 48204.8 49467.3 49509.8 49530.0 49570.3 1060.4 1185.6 1221.1 1223.4 1230.2 26224.6 27506.3 27662.4 28046.9 28219.0 40165.4 41110.0 41161.6 41282.8 41317.2 233576.0 239077.0 239892.0 239948.0 243046.0 27401.5 33791.5 33838.2 33868.3 34022.1 37862.0 38301.2 39043.2 39564.8 39789.4 35310.3 36601.5 36970.6 37040.4 37365.6 36117.5 36415.8 36765.8 36838.6 36986.3 35117.0 35981.3 36228.6 36508.0 36932.3 32246.2 32559.7 33040.3 33277.0 33530.5 25142.7 25305.6 25618.2 25829.2 26006.0 17:47:04 INFO - PROCESS | 19818 | 17:47:04 INFO - PROCESS | 19818 | [#2] jquery.html Cycles:180 Average:25507.39 Median:5544.87 stddev:70410.35 (1269.8%) stddev-sans-first:70582.59 17:47:04 INFO - PROCESS | 19818 | Values: 377.7 378.5 379.0 379.1 389.0 15541.3 16244.1 16644.1 16666.2 16693.5 16105.2 16118.3 16933.1 16955.9 16964.9 5051.4 5217.8 5227.4 5249.6 5253.4 3631.3 3773.1 4049.8 5785.5 6102.4 5997.8 6036.0 6047.3 6065.9 6071.1 5955.0 6006.8 6009.8 6014.2 6022.1 3383.2 5034.7 5143.7 5303.2 5304.3 18962.2 19103.3 19113.9 19769.7 20483.8 2097.0 2184.9 2409.7 2507.4 2530.6 12278.6 12611.3 12793.8 12888.9 13304.5 1739.6 1795.9 1806.0 1839.7 1848.1 67985.3 70441.6 70659.6 70666.6 70949.6 9436.4 9556.3 9720.7 9771.7 9801.1 13597.2 13677.9 13716.2 13731.9 13751.0 7422.5 7443.8 7454.9 7602.8 7682.5 7126.8 7169.9 7184.1 7297.6 7330.9 6078.9 6135.1 6163.1 6203.8 6295.9 1646.8 1717.6 1748.5 1775.6 1825.9 845.4 853.2 894.0 897.6 908.3 15832.4 16363.3 16721.7 18278.3 18411.5 855.7 859.4 896.2 905.8 916.2 7305.7 10213.2 10421.4 10422.6 10459.4 422182.0 426211.0 426907.0 427463.0 430639.0 75334.6 85043.0 85317.6 87574.0 87662.6 941.6 951.1 975.8 983.7 985.5 15336.2 15403.0 15465.6 15594.8 15904.4 35378.5 36327.6 36812.8 36876.4 37004.6 49796.5 50129.7 51833.0 51834.7 52062.0 7093.6 7319.2 7339.3 7419.9 7473.9 9570.5 10811.1 10835.3 10984.5 11042.8 8609.8 8806.4 8904.7 9149.8 9337.8 9470.3 9684.9 9733.0 9763.8 9777.3 8875.4 8981.9 9033.7 9034.1 9241.0 7341.9 7486.3 7510.0 7515.8 7593.2 7220.1 8895.3 9249.2 9283.2 9401.9 17:47:04 INFO - PROCESS | 19818 | 17:47:04 INFO - PROCESS | 19818 | [#3] mootools.html Cycles:180 Average:5070.45 Median:5330.35 stddev:2864.13 (53.7%) stddev-sans-first:2857.83 17:47:04 INFO - PROCESS | 19818 | Values: 1258.0 1405.9 1423.5 1511.3 1711.1 7258.5 7513.5 7541.5 7551.6 7552.1 7314.3 7471.6 7491.4 7492.2 7493.6 2154.2 2186.2 2186.5 2188.4 2188.6 2049.5 2060.7 2155.1 2167.6 2168.1 2139.5 2191.3 2197.6 2198.8 2199.8 2143.6 2144.8 2146.0 2157.1 2157.6 2035.1 2086.6 2090.6 2092.0 2098.0 7611.2 7641.5 7699.1 7700.0 7884.2 4468.8 4582.2 4588.6 4602.7 4615.2 2791.9 2829.8 2866.0 2870.1 2902.0 901.3 907.7 908.8 909.9 922.6 10476.7 10545.9 10557.3 10586.2 10592.5 3988.1 4053.9 4089.1 4164.4 4168.9 8429.9 8446.9 8453.5 8462.5 8465.9 4279.9 4323.7 4328.4 4330.6 4336.0 3721.5 3996.0 4111.2 4140.3 4206.3 3438.3 3440.8 3514.8 3530.9 3558.1 1036.0 1038.4 1040.5 1051.5 1064.4 866.0 873.7 881.7 900.4 921.7 5284.7 5376.0 5401.5 5578.0 5604.6 378.4 404.8 407.7 407.9 408.2 3807.2 3965.4 4008.7 4009.4 4070.2 9511.6 9722.1 9900.7 9969.5 9981.7 9754.6 9819.2 9826.3 9851.6 9861.7 7219.4 7430.7 7504.7 7520.0 7526.5 5471.5 5518.4 5545.8 5594.2 5638.4 8717.0 8871.1 8945.2 8958.1 8973.6 8903.7 8926.6 8985.9 9188.3 9216.0 5766.9 6160.1 6340.8 6380.9 6518.5 7143.6 7147.6 7207.5 7212.3 7231.1 6352.5 6535.1 6570.7 6627.7 6683.8 6325.2 6352.0 6356.1 6446.1 6458.8 6345.8 6386.6 6390.9 6391.9 6413.7 4471.9 4476.3 4533.9 4623.1 4645.7 4707.5 4792.9 4798.3 4859.4 4868.5 17:47:04 INFO - PROCESS | 19818 | 17:47:04 INFO - PROCESS | 19818 | [#4] prototype.html Cycles:180 Average:4237.10 Median:4699.98 stddev:1215.65 (25.9%) stddev-sans-first:1182.45 17:47:04 INFO - PROCESS | 19818 | Values: 292.4 295.4 295.7 299.8 314.1 4563.3 4662.6 4715.3 4738.9 4784.0 4545.8 4689.7 4697.2 4702.7 4705.7 3746.7 3751.6 3755.2 3760.0 3764.0 3525.9 3624.2 3737.3 3764.6 3781.0 3745.6 3760.2 3764.4 3769.6 3780.1 3726.1 3743.5 3745.3 3764.5 3780.2 3363.4 3366.0 3369.8 3374.5 3377.0 4504.4 4508.5 4562.8 4574.0 4586.1 4275.3 4287.4 4298.8 4300.3 4308.3 4888.7 4927.9 4948.0 4949.2 4968.4 3543.7 3608.9 3639.0 3649.6 3663.9 5167.8 5169.8 5170.9 5208.0 5220.2 3720.3 3741.0 3743.5 3766.4 3768.6 3813.3 3817.5 3822.9 3828.7 3838.2 4132.3 4278.8 4286.6 4287.3 4291.1 4857.6 4952.2 4988.1 4998.7 5004.1 1307.7 1337.0 1362.7 1386.5 1386.6 938.3 946.2 957.7 967.5 970.3 4611.0 4635.6 4645.1 4645.3 4650.7 5419.7 5423.9 5425.9 5432.3 5434.8 4482.6 4610.9 4620.0 4622.9 4646.5 2905.8 2909.8 2922.5 2925.0 2931.2 5099.7 5109.5 5110.7 5112.1 5131.0 5408.2 5542.8 5561.0 5569.6 5580.4 5007.9 5039.0 5043.3 5050.5 5054.5 5361.4 5403.4 5410.3 5417.1 5427.8 5186.7 5288.8 5297.8 5303.5 5317.5 5023.4 5034.7 5035.3 5048.6 5065.7 3898.0 3901.3 3902.9 3917.2 3929.0 4875.7 5297.8 5373.9 5389.9 5435.6 4819.7 4970.3 5010.0 5018.2 5020.8 4961.7 4971.6 4985.5 4987.6 4994.1 4680.7 4735.4 4788.6 4911.6 4915.9 4946.3 5019.2 5031.2 5036.5 5049.4 4900.9 4901.8 4906.5 4937.8 4940.8 17:47:04 INFO - PROCESS | 19818 | 17:47:04 INFO - PROCESS | 19818 | [#5] yui.html Cycles:180 Average:11824.10 Median:605.32 stddev:13819.88 (2283.1%) stddev-sans-first:13832.96 17:47:04 INFO - PROCESS | 19818 | Values: 603.9 641.5 687.6 691.8 708.4 11108.4 11681.9 11822.8 11997.3 12018.5 10348.9 10539.3 10540.9 10564.8 10582.8 633.7 769.8 791.2 811.3 811.4 803.9 811.3 812.3 812.4 812.7 851.5 853.4 854.9 856.9 856.9 661.7 807.5 831.3 845.9 847.2 606.8 606.9 609.3 610.8 611.4 11600.7 11646.9 11654.4 11660.0 11677.2 11323.2 11376.0 11790.5 12068.2 12243.6 9334.6 9411.9 9465.2 9472.0 9613.4 3281.0 3329.7 3357.7 3441.9 3444.5 40960.8 41581.6 42049.6 42146.8 42428.2 9333.6 9533.4 9552.9 9622.9 9906.8 16648.9 16738.0 16774.5 16834.8 16852.2 6299.8 6360.6 6490.9 6618.9 6781.9 3432.1 3456.8 3482.2 3511.4 3536.2 2776.1 2815.0 2823.7 2826.5 2828.4 488.8 499.0 512.2 514.3 517.1 381.9 480.4 486.5 543.9 556.4 7167.6 7245.5 7281.7 7318.0 7460.3 501.8 541.8 560.6 568.1 578.0 3400.2 3480.8 3492.0 3504.9 3512.4 48114.3 48517.3 49204.8 50340.0 50661.5 44752.6 44782.3 45227.0 45919.0 46247.8 41196.4 41333.6 41538.6 41608.0 41804.8 6524.6 6693.2 6748.3 6770.6 6826.1 28232.6 29112.7 29143.7 29187.3 29467.4 35033.3 36695.9 37345.3 37456.1 37663.1 8771.9 8836.2 8976.7 9006.6 9209.6 9164.3 9313.8 9322.5 9414.4 9489.0 8858.3 8888.2 9042.2 9117.3 9153.2 8601.7 8725.8 8774.0 8813.1 8874.3 8559.9 8642.0 8730.0 8748.4 8780.7 7595.5 7664.5 7692.5 7699.8 8187.0 7697.8 7953.8 8000.5 8136.3 8236.2 17:47:04 INFO - PROCESS | 19818 | -------- Summary: end -------- 17:47:04 INFO - PROCESS | 19818 | 17:47:04 INFO - TEST-INFO | 19818: exit 0 17:47:04 INFO - TEST-OK | dromaeo_css | took 1117455ms 17:47:04 INFO - TEST-START | kraken 17:47:04 INFO - operating with platform_type : linux_ 17:47:04 INFO - Initialising browser for kraken test... 17:47:04 INFO - TEST-INFO | started process 19992 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJoo7h_/profile http://localhost:40546/getInfo.html) 17:47:09 INFO - PROCESS | 19992 | __metrics Screen width/height:1600/1200 17:47:09 INFO - PROCESS | 19992 | colorDepth:24 17:47:09 INFO - PROCESS | 19992 | Browser inner width/height: 1024/697 17:47:09 INFO - PROCESS | 19992 | __metrics 17:47:10 ERROR - PROCESS | 19992 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 17:47:10 INFO - TEST-INFO | 19992: exit 0 17:47:10 INFO - Browser initialized. 17:47:10 INFO - Running cycle 1/1 for kraken test... 17:47:10 INFO - TEST-INFO | started process 20072 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpJoo7h_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:47:22 INFO - PROCESS | 20072 | RSS: Main: 156266496 17:47:22 INFO - PROCESS | 20072 | 17:47:25 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:40546/tests/kraken/driver.html?testName=audio-beat-detection) 17:47:26 INFO - PROCESS | 20072 | RSS: Main: 210903040 17:47:26 INFO - PROCESS | 20072 | 17:47:29 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:40546/tests/kraken/driver.html?testName=audio-dft) 17:47:29 INFO - PROCESS | 20072 | RSS: Main: 197713920 17:47:29 INFO - PROCESS | 20072 | 17:47:33 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:40546/tests/kraken/driver.html?testName=audio-fft) 17:47:33 INFO - PROCESS | 20072 | RSS: Main: 267743232 17:47:33 INFO - PROCESS | 20072 | 17:47:35 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:40546/tests/kraken/driver.html?testName=audio-oscillator) 17:47:36 INFO - PROCESS | 20072 | RSS: Main: 175013888 17:47:36 INFO - PROCESS | 20072 | 17:47:38 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:40546/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:47:39 INFO - PROCESS | 20072 | RSS: Main: 179900416 17:47:39 INFO - PROCESS | 20072 | 17:47:42 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:40546/tests/kraken/driver.html?testName=imaging-darkroom) 17:47:43 INFO - PROCESS | 20072 | RSS: Main: 215736320 17:47:43 INFO - PROCESS | 20072 | 17:47:46 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:40546/tests/kraken/driver.html?testName=imaging-desaturate) 17:47:47 INFO - PROCESS | 20072 | RSS: Main: 216461312 17:47:47 INFO - PROCESS | 20072 | 17:47:50 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:40546/tests/kraken/driver.html?testName=json-parse-financial) 17:47:50 INFO - PROCESS | 20072 | RSS: Main: 216600576 17:47:50 INFO - PROCESS | 20072 | 17:47:52 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:40546/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:47:52 INFO - PROCESS | 20072 | RSS: Main: 202874880 17:47:52 INFO - PROCESS | 20072 | 17:47:54 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:40546/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:47:55 INFO - PROCESS | 20072 | RSS: Main: 204935168 17:47:55 INFO - PROCESS | 20072 | 17:47:57 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:40546/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:47:58 INFO - PROCESS | 20072 | RSS: Main: 217784320 17:47:58 INFO - PROCESS | 20072 | 17:48:01 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:40546/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:48:01 INFO - PROCESS | 20072 | RSS: Main: 226652160 17:48:01 INFO - PROCESS | 20072 | 17:48:04 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:40546/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:48:05 INFO - PROCESS | 20072 | RSS: Main: 220786688 17:48:05 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | Cycle 1(1): loaded http://localhost:40546/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:40546/tests/kraken/driver.html?testName=ai-astar) 17:48:07 INFO - PROCESS | 20072 | RSS: Main: 283701248 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | __start_tp_report 17:48:07 INFO - PROCESS | 20072 | _x_x_mozilla_page_load 17:48:07 INFO - PROCESS | 20072 | _x_x_mozilla_page_load_details 17:48:07 INFO - PROCESS | 20072 | |i|pagename|runs| 17:48:07 INFO - PROCESS | 20072 | |0;ai-astar;114;115;108;113;113;115;102;112;114;113 17:48:07 INFO - PROCESS | 20072 | |1;audio-beat-detection;162;138;156;183;144;159;161;135;196;135 17:48:07 INFO - PROCESS | 20072 | |2;audio-dft;160;160;162;163;161;162;163;162;161;161 17:48:07 INFO - PROCESS | 20072 | |3;audio-fft;77;77;110;116;76;76;77;114;102;77 17:48:07 INFO - PROCESS | 20072 | |4;audio-oscillator;95;95;146;94;94;94;143;93;94;148 17:48:07 INFO - PROCESS | 20072 | |5;imaging-gaussian-blur;117;117;117;117;116;116;117;116;117;117 17:48:07 INFO - PROCESS | 20072 | |6;imaging-darkroom;146;145;144;146;146;146;145;147;146;145 17:48:07 INFO - PROCESS | 20072 | |7;imaging-desaturate;94;95;94;94;94;95;95;94;94;94 17:48:07 INFO - PROCESS | 20072 | |8;json-parse-financial;69;69;69;69;69;69;69;86;67;67 17:48:07 INFO - PROCESS | 20072 | |9;json-stringify-tinderbox;67;66;65;66;65;66;66;66;65;66 17:48:07 INFO - PROCESS | 20072 | |10;stanford-crypto-aes;81;81;80;81;84;81;81;82;82;82 17:48:07 INFO - PROCESS | 20072 | |11;stanford-crypto-ccm;138;132;132;140;130;131;130;134;166;133 17:48:07 INFO - PROCESS | 20072 | |12;stanford-crypto-pbkdf2;182;185;176;175;176;176;173;175;174;175 17:48:07 INFO - PROCESS | 20072 | |13;stanford-crypto-sha256-iterative;78;72;74;81;73;73;74;75;73;73 17:48:07 INFO - PROCESS | 20072 | __end_tp_report 17:48:07 INFO - PROCESS | 20072 | __start_cc_report 17:48:07 INFO - PROCESS | 20072 | _x_x_mozilla_cycle_collect,1913 17:48:07 INFO - PROCESS | 20072 | __end_cc_report 17:48:07 INFO - PROCESS | 20072 | __startTimestamp1461977287321__endTimestamp 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | ------- Summary: start ------- 17:48:07 INFO - PROCESS | 20072 | Number of tests: 14 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#0] ai-astar Cycles:10 Average:111.90 Median:113.50 stddev:4.01 (3.5%) stddev-sans-first:4.18 17:48:07 INFO - PROCESS | 20072 | Values: 114.0 115.0 108.0 113.0 113.0 115.0 102.0 112.0 114.0 113.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#1] audio-beat-detection Cycles:10 Average:156.90 Median:160.00 stddev:20.39 (12.7%) stddev-sans-first:21.54 17:48:07 INFO - PROCESS | 20072 | Values: 162.0 138.0 156.0 183.0 144.0 159.0 161.0 135.0 196.0 135.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#2] audio-dft Cycles:10 Average:161.50 Median:162.00 stddev:1.08 (0.7%) stddev-sans-first:1.00 17:48:07 INFO - PROCESS | 20072 | Values: 160.0 160.0 162.0 163.0 161.0 162.0 163.0 162.0 161.0 161.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#3] audio-fft Cycles:10 Average:90.20 Median:76.50 stddev:17.84 (23.3%) stddev-sans-first:18.27 17:48:07 INFO - PROCESS | 20072 | Values: 77.0 77.0 110.0 116.0 76.0 76.0 77.0 114.0 102.0 77.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#4] audio-oscillator Cycles:10 Average:109.60 Median:94.00 stddev:24.92 (26.5%) stddev-sans-first:25.87 17:48:07 INFO - PROCESS | 20072 | Values: 95.0 95.0 146.0 94.0 94.0 94.0 143.0 93.0 94.0 148.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 17:48:07 INFO - PROCESS | 20072 | Values: 117.0 117.0 117.0 117.0 116.0 116.0 117.0 116.0 117.0 117.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#6] imaging-darkroom Cycles:10 Average:145.60 Median:146.00 stddev:0.84 (0.6%) stddev-sans-first:0.88 17:48:07 INFO - PROCESS | 20072 | Values: 146.0 145.0 144.0 146.0 146.0 146.0 145.0 147.0 146.0 145.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#7] imaging-desaturate Cycles:10 Average:94.30 Median:94.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 17:48:07 INFO - PROCESS | 20072 | Values: 94.0 95.0 94.0 94.0 94.0 95.0 95.0 94.0 94.0 94.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#8] json-parse-financial Cycles:10 Average:70.30 Median:69.00 stddev:5.58 (8.1%) stddev-sans-first:5.90 17:48:07 INFO - PROCESS | 20072 | Values: 69.0 69.0 69.0 69.0 69.0 69.0 69.0 86.0 67.0 67.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#9] json-stringify-tinderbox Cycles:10 Average:65.80 Median:66.00 stddev:0.63 (1.0%) stddev-sans-first:0.50 17:48:07 INFO - PROCESS | 20072 | Values: 67.0 66.0 65.0 66.0 65.0 66.0 66.0 66.0 65.0 66.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#10] stanford-crypto-aes Cycles:10 Average:81.50 Median:81.50 stddev:1.08 (1.3%) stddev-sans-first:1.13 17:48:07 INFO - PROCESS | 20072 | Values: 81.0 81.0 80.0 81.0 84.0 81.0 81.0 82.0 82.0 82.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#11] stanford-crypto-ccm Cycles:10 Average:136.60 Median:133.50 stddev:10.84 (8.1%) stddev-sans-first:11.49 17:48:07 INFO - PROCESS | 20072 | Values: 138.0 132.0 132.0 140.0 130.0 131.0 130.0 134.0 166.0 133.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:176.70 Median:176.00 stddev:3.77 (2.1%) stddev-sans-first:3.48 17:48:07 INFO - PROCESS | 20072 | Values: 182.0 185.0 176.0 175.0 176.0 176.0 173.0 175.0 174.0 175.0 17:48:07 INFO - PROCESS | 20072 | 17:48:07 INFO - PROCESS | 20072 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:74.60 Median:74.00 stddev:2.80 (3.8%) stddev-sans-first:2.68 17:48:07 INFO - PROCESS | 20072 | Values: 78.0 72.0 74.0 81.0 73.0 73.0 74.0 75.0 73.0 73.0 17:48:07 INFO - PROCESS | 20072 | -------- Summary: end -------- 17:48:07 INFO - PROCESS | 20072 | 17:48:08 INFO - TEST-INFO | 20072: exit 0 17:48:08 INFO - TEST-OK | kraken | took 63407ms 17:48:08 INFO - SUITE-END | took 1180s 17:48:08 INFO - Completed test suite (00:19:40) 17:48:08 INFO - javascript benchmark 17:48:08 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2555.619965218782, 2623.317937336293, 2632.6972398174194, 2647.351398907268, 2661.973380266198, 4493.528179541142, 4605.0, 4628.699134556256, 4631.953680463199, 4647.093816705744, 4589.931151032737, 4599.7010194337345, 4613.215753321935, 4672.976635116828, 4679.251319788835, 4195.832166713328, 4218.346156345771, 4237.152569486115, 4265.7014009019385, 4404.625606823424, 4347.8260869565165, 4354.978225108885, 4361.6510679145595, 4380.6495480361655, 4407.559244075599, 4143.96400899775, 4232.9153416931795, 4233.047564298008, 4239.046214601721, 4286.014216730138, 4186.727862688916, 4224.8732538023905, 4233.216854881856, 4234.195502854479, 4280.336547835091, 4262.339337402707, 4303.139372125556, 4303.139372125587, 4327.545607711177, 4328.199283132631, 4419.712718673308, 4514.706544074625, 4578.336141259499, 4582.679212455129, 4591.380163677894, 4942.357493525818, 4945.67853089548, 4960.255961605788, 4965.428975667808, 4970.552650261494, 4979.526944940225, 4988.65079444439, 5003.224500202475, 5006.173981293082, 5035.471275516092, 4533.863984080483, 4601.539846015438, 4652.906941861143, 4687.296905464208, 4688.671792974459, 5106.821261255838, 5114.079465696211, 5126.974365128151, 5131.897362052738, 5176.611754118456, 4727.456342520654, 4907.730074845917, 4910.361652985089, 4916.729579873141, 4916.901661966741, 4933.703977761345, 5019.648624596316, 5030.044291584587, 5036.06832735945, 5040.017196646619, 4883.633727470454, 4906.828261010919, 4909.337239472697, 4913.508649135058, 4958.8512344629, 4879.1461494238365, 4888.3581731610175, 4890.021995600894, 4895.118878601815, 4938.678985865908, 4150.418941348214, 4218.430511880857, 4222.514410842731, 4223.429836971969, 4224.852130175429, 3681.318955993096, 3728.459373390843, 3746.1758413149064, 3761.736678432538, 3782.791946442972, 4277.358396240589, 4293.892652683646, 4297.5702429756775, 4302.612764851116, 4339.414179085783, 4914.5822605078965, 4953.578945789576, 4955.801767929314, 4957.90084198314, 4988.90022199554, 4203.747775133441, 4288.871333859989, 4342.478902531717, 4371.868843934687, 4395.055063161436, 4442.800073996613, 4454.532274111237, 4456.064226512469, 4457.1308594823695, 4487.6634252431195, 4515.90968180628, 4636.559526844944, 4637.86086417408, 4641.280601506772, 4643.95356046442, 4968.478309777566, 5020.799168033238, 5021.171506701499, 5036.722980235975, 5070.6957582545165, 4664.416947881515, 4685.953140468688, 4688.695234809727, 4690.179218636793, 4703.435587729495, 4819.180739274402, 4858.1012512685265, 4882.170031094652, 4900.509949005071, 4951.0, 4940.950590494049, 4962.602991760578, 4964.602831773522, 4965.751712414292, 5015.548600625962, 4824.0834241494, 4824.903501930012, 4827.831025914216, 4831.0820944020525, 4876.244182151772, 4721.362616046789, 4734.834280800155, 4821.5178482151505, 4821.710697358029, 4875.024995001085, 4726.881827954328, 4754.786034628381, 4765.046990601824, 4783.689060211075, 4802.807887684593, 4772.689775164603, 4782.187028205283, 4785.282207668877, 4858.0, 4873.805047798049, 4665.5101214372, 4705.988212534322, 4709.646776491708, 4741.383620129361, 4804.519548045308], "value": 4556.013488253746, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [566.7308028686374, 602.8884656338578, 606.6329870428387, 611.2909025530386, 622.0637939900449, 33531.83234083829, 33658.83170584147, 34596.48105278423, 34623.13442163947, 35585.82207088964, 36359.454608180895, 36912.446313305256, 36970.44544331837, 37214.62785372145, 37256.81371593145, 7240.348368646821, 7367.742129025485, 7514.924850751505, 7532.058492688414, 9397.248220142406, 9506.287028472892, 9683.661071862487, 9693.563789629483, 9697.612095516171, 9700.223982081416, 9598.904010959906, 9726.805463890718, 9734.026597340244, 9734.51327433629, 9736.464494452803, 9444.527773611326, 9525.904740952572, 9528.38065525742, 9555.569999350046, 9556.713298601053, 9786.902130978742, 9900.950495247549, 9906.504674766305, 9912.35569687968, 9918.652847150388, 38470.23059538822, 38953.61046389528, 39020.41469377962, 39023.219535609416, 39048.0, 3101.720845123927, 3108.2074071111947, 3128.2335827722127, 3154.5899033125547, 3170.4134735074085, 29262.0, 29992.55011174834, 29997.250068748457, 30039.837849455907, 30888.0733577993, 3149.889753858604, 3174.5238214267815, 3213.8714451421915, 3221.4040402525607, 3274.492453669685, 250451.0, 251922.74038629874, 252152.0, 252245.0, 252940.0, 52896.0, 53074.73462632662, 53199.0, 53229.46770532245, 53248.870045198535, 56427.435725642215, 56722.43277567254, 56723.43276567264, 56735.0, 56761.43238567644, 14549.0, 14850.183239921693, 14876.256187190813, 14901.478448254258, 14947.878909081863, 9977.0, 10886.510107045202, 11111.222214444912, 11113.388763618079, 11122.49948752308, 15547.37810487568, 15628.655701644844, 15657.373705051898, 15695.764563531557, 15799.526014219591, 5935.376785437553, 6110.663913484801, 6141.169462920661, 6267.467265282411, 6339.904901426482, 850.8170743290223, 884.712468447757, 917.5045475443186, 929.0384452092052, 1046.0794500839213, 27919.581206281517, 28334.149975500768, 28394.43211135766, 28751.712482875322, 28919.0, 978.3933960944117, 989.7525618595351, 995.7012896131132, 1054.2672842374477, 1094.7044298039484, 15126.546203613909, 15307.311170997333, 15326.080435173924, 15326.540203793904, 15449.31825178504, 348809.0, 354823.0, 355210.0, 356391.0, 356772.0, 48204.758976204896, 49467.257991130165, 49509.75245123752, 49530.0, 49570.25644615333, 1060.3531845574194, 1185.6424394068742, 1221.065884598283, 1223.3760782001243, 1230.1819290171936, 26224.60663090017, 27506.312342191606, 27662.446751064464, 28046.85976570104, 28219.0, 40165.397519036655, 41110.0, 41161.58838411578, 41282.793586031876, 41317.1736565273, 233576.0, 239077.0, 239892.0, 239948.0, 243046.0, 27401.45197096087, 33791.49312760261, 33838.15404614806, 33868.3226335467, 34022.14944626404, 37862.0, 38301.233975320894, 39043.219135616564, 39564.80217598894, 39789.40315895206, 35310.29379412449, 36601.45097823588, 36970.630293697795, 37040.44439333466, 37365.626343737305, 36117.45823812697, 36415.81792091022, 36765.81617091897, 36838.63161368352, 36986.26027479489, 35117.0, 35981.28037439289, 36228.63771362253, 36508.0, 36932.26135477329, 32246.19384515312, 32559.674403255663, 33040.33919321648, 33277.0, 33530.49704254487, 25142.69264748207, 25305.620415694146, 25618.23145305644, 25829.22512324633, 26006.0], "value": 17715.510072801037, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [377.70161572357836, 378.4777007729333, 379.0, 379.0920744816165, 388.99222015559707, 15541.300641471133, 16244.106574138417, 16644.08457534835, 16666.1666916654, 16693.499195024153, 16105.194740263, 16118.274677639534, 16933.06868122253, 16955.91522042391, 16964.915175424107, 5051.444341122474, 5217.791288348461, 5227.372715274153, 5249.635094875341, 5253.422123566424, 3631.2918980798754, 3773.056735816046, 4049.817758200888, 5785.479306862381, 6102.389761023906, 5997.820065398045, 6036.0, 6047.334793172748, 6065.939340606604, 6071.058985857199, 5954.97022514889, 6006.8498287542725, 6009.789657361993, 6014.188084608566, 6022.126791615213, 3383.2387712764676, 5034.723090230036, 5143.665661732013, 5303.178007408857, 5304.25740396341, 18962.24151033957, 19103.33138340165, 19113.90443047776, 19769.703454448194, 20483.795162048486, 2097.024883429213, 2184.90167942443, 2409.6746939163163, 2507.4358269389422, 2530.595104783226, 12278.570250041206, 12611.306378149198, 12793.808092878615, 12888.871111288861, 13304.467821287233, 1739.6085880676874, 1795.8832675876156, 1805.9548511287323, 1839.6504664113775, 1848.122141982561, 67985.32014679839, 70441.64779176122, 70659.64670176667, 70666.64666676686, 70949.64525177392, 9436.386634868848, 9556.331056825955, 9720.708378748648, 9771.657991970247, 9801.117899388946, 13597.184168949894, 13677.931610341884, 13716.177029378268, 13731.931340343235, 13751.037427379988, 7422.517536360119, 7443.7766866993, 7454.925450745423, 7602.8099297518, 7682.462227644123, 7126.750563730245, 7169.856602867913, 7184.137903451619, 7297.562146271241, 7330.8900366494545, 6078.908816367758, 6135.128785720398, 6163.137160797492, 6203.8138855834395, 6295.905561416583, 1646.7941507311587, 1717.5706073481629, 1748.4579780268157, 1775.5561109722569, 1825.8813177143443, 845.4420082745359, 853.2320911179987, 893.9942564614809, 897.6274845938863, 908.3051465628799, 15832.366705331659, 16363.345466181458, 16721.749173762404, 18278.268869245083, 18411.539711507052, 855.7090589199702, 859.4284800607651, 896.1799953043023, 905.7509184974185, 916.2029034739686, 7305.671244793997, 10213.247445447469, 10421.374717516974, 10422.635207767691, 10459.431085337108, 422182.0, 426211.0, 426907.0, 427463.0, 430639.0, 75334.62332688412, 85043.0, 85317.57341213254, 87574.0, 87662.56168719243, 941.5527624378366, 951.0632027452954, 975.7804493988938, 983.7196399026386, 985.4973963278779, 15336.156511391535, 15403.0, 15465.613359666098, 15594.766078509057, 15904.363825446853, 35378.46932295966, 36327.63672363242, 36812.815935920145, 36876.446853296686, 37004.62995370012, 49796.50203498064, 50129.74935125447, 51833.0, 51834.74082629563, 52062.0, 7093.609851458219, 7319.194888562361, 7339.339459448675, 7419.9258007421395, 7473.878918162101, 9570.47362395075, 10811.13510919109, 10835.349879007284, 10984.451824591823, 11042.779144417227, 8609.784755381166, 8806.427582207136, 8904.732858014011, 9149.77125571866, 9337.813243735223, 9470.289728270269, 9684.854727178958, 9732.951335243279, 9763.804723905625, 9777.273315610826, 8875.423097498642, 8981.910180898369, 9033.683821066232, 9034.14175653312, 9240.95379523098, 7341.889871651822, 7486.326230639269, 7510.0, 7515.849683006419, 7593.202713714981, 7220.0613920190035, 8895.332850036144, 9249.16757491829, 9283.210927071004, 9401.905980940102], "value": 8322.12207174012, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1257.9748405031905, 1405.8945579081571, 1423.5444657709531, 1511.32745928062, 1711.1187738314761, 7258.491905566606, 7513.511621744583, 7541.472096953223, 7551.622418879061, 7552.093748750144, 7314.305141011609, 7471.626418679071, 7491.363234125092, 7492.175860655324, 7493.625318734069, 2154.246013895136, 2186.169255682846, 2186.486175748698, 2188.3763127508664, 2188.6498160294354, 2049.5388537579074, 2060.7115003899467, 2155.051777218027, 2167.566486702658, 2168.1002384010617, 2139.5399989002362, 2191.3206905859156, 2197.6154173019736, 2198.758136604972, 2199.824014078878, 2143.6034333648327, 2144.774798646143, 2145.967810482844, 2157.0616781699932, 2157.5684863027377, 2035.1350675962806, 2086.634838903201, 2090.592334494774, 2091.979080209194, 2097.958040839175, 7611.1627720950655, 7641.541507509512, 7699.1146018208065, 7700.0, 7884.21157884207, 4468.82124715011, 4582.152301824173, 4588.6099681526775, 4602.6548008899135, 4615.192341340252, 2791.8743656535503, 2829.8160619559662, 2866.025551312543, 2870.1389583125188, 2902.0, 901.33301356996, 907.668700924158, 908.8182363527255, 909.8726178335038, 922.5940586142076, 10476.68569942903, 10545.894541054491, 10557.260991730582, 10586.20603454744, 10592.523336449878, 3988.12261302513, 4053.918921621551, 4089.1208390196252, 4164.354525048561, 4168.937465938014, 8429.915700842914, 8446.873296900552, 8453.450525715809, 8462.534560599102, 8465.915340846514, 4279.893002674958, 4323.69734118615, 4328.415663885336, 4330.610245077958, 4335.956640433618, 3721.5348081489815, 3996.020974861178, 4111.157212771374, 4140.337545992687, 4206.26390381682, 3438.346714124308, 3440.7591468596956, 3514.806685632315, 3530.911727206789, 3558.1282585766653, 1036.0468369100445, 1038.444432228754, 1040.5161599856103, 1051.4795176387584, 1064.3826580583243, 865.9913400865911, 873.6592728835759, 881.7354793561906, 900.3652425040331, 921.7234829551107, 5284.7093409862055, 5376.0, 5401.459854014567, 5577.972110139423, 5604.607677462538, 378.38701303887876, 404.7895094550817, 407.74515927545286, 407.94696689430776, 408.24270977336613, 3807.2195199983935, 3965.4250133730447, 4008.6793056555407, 4009.398590211433, 4070.2266569351727, 9511.57197926095, 9722.076402741728, 9900.65347712841, 9969.451680157661, 9981.650642227487, 9754.609815607297, 9819.214462842956, 9826.312158149003, 9851.556679949419, 9861.704148875402, 7219.422446204396, 7430.702771889172, 7504.737334193277, 7520.022397088453, 7526.5107767994905, 5471.452854714496, 5518.42056584069, 5545.750441230073, 5594.1608758686525, 5638.436156384329, 8717.0, 8871.068537803438, 8945.23965462943, 8958.148975847284, 8973.641054357753, 8903.688370906988, 8926.598303076507, 8985.910140898508, 9188.264938805014, 9216.032316606928, 5766.94233057664, 6160.10678451631, 6340.841478963062, 6380.904286435614, 6518.5111116667385, 7143.642817858982, 7147.606881621561, 7207.531510451804, 7212.278772122746, 7231.05996220509, 6352.491800655844, 6535.085088087767, 6570.737170513126, 6627.734890604322, 6683.799486015428, 6325.240971083315, 6352.0, 6356.141920840627, 6446.065320528591, 6458.806235812745, 6345.777897773556, 6386.552941294065, 6390.936090639034, 6391.8721625566295, 6413.679316034273, 4471.932921006252, 4476.306172543261, 4533.863984080483, 4623.098495793422, 4645.674802763774, 4707.529247075265, 4792.904141917073, 4798.3042458843975, 4859.3682821233015, 4868.513148685245], "value": 4008.6577751038863, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [292.3801540733645, 295.4357177790421, 295.6762345231971, 299.7976365952982, 314.0875755929027, 4563.26987681971, 4662.626989840813, 4715.269133284338, 4738.90522189556, 4783.952160478399, 4545.795439205235, 4689.718616882989, 4697.224957881954, 4702.741349225791, 4705.741184234866, 3746.662800347982, 3751.6060813614586, 3755.248950209955, 3760.0411894966746, 3764.0238874590787, 3525.8717210492655, 3624.1845584743355, 3737.2712321097397, 3764.5670747864074, 3781.0358358618514, 3745.644163804448, 3760.2479504099288, 3764.3976963685814, 3769.5853456119803, 3780.092777733352, 3726.142987112966, 3743.47591337213, 3745.277172500639, 3764.4729737836724, 3780.1683629601443, 3363.360961417323, 3366.0, 3369.7641165118453, 3374.493825926106, 3376.9831150844334, 4504.414426124616, 4508.458984921797, 4562.771861406916, 4573.977130114361, 4586.105709386671, 4275.315949448073, 4287.421198138242, 4298.8393133854, 4300.279888044807, 4308.332208507655, 4888.655619704574, 4927.926081108751, 4947.975260123712, 4949.183384741514, 4968.354113965198, 3543.724259266662, 3608.9278214435562, 3638.981805090984, 3649.6167902370134, 3663.9084022899374, 5167.844964651029, 5169.844904652867, 5170.93162734909, 5207.973960130251, 5220.216967454874, 3720.2745464634677, 3741.0, 3743.513343265358, 3766.4350347448103, 3768.6231376862092, 3813.254456791106, 3817.4655548223272, 3822.8853134406013, 3828.69824259753, 3838.213166300902, 4132.318167502389, 4278.807453664593, 4286.635635970977, 4287.292596721569, 4291.0559676871035, 4857.635677324144, 4952.158133117378, 4988.102141614471, 4998.6750861193905, 5004.099262132851, 1307.6992291772945, 1336.9799453008213, 1362.7070179911366, 1386.5216500307379, 1386.5563019833558, 938.2962777916563, 946.2430055955208, 957.698325027614, 967.5210770668564, 970.3062310448064, 4611.0, 4635.629149668019, 4645.117427688729, 4645.349651048856, 4650.674452788272, 5419.674819510842, 5423.945760542423, 5425.945740542623, 5432.320959880015, 5434.83695489136, 4482.641388688897, 4610.861674149781, 4619.976900115478, 4622.884427889329, 4646.535346465326, 2905.825650460979, 2909.8254104753782, 2922.503174460347, 2925.049358958347, 2931.1646180838784, 5099.719515426613, 5109.514596113363, 5110.71891045996, 5112.105381558213, 5130.974345128325, 5408.215808707715, 5542.806001789918, 5560.972195139079, 5569.610127291051, 5580.358258800209, 5007.924881126786, 5038.974805125951, 5043.293938848564, 5050.4697006814495, 5054.4692807254705, 5361.437049109787, 5403.351597808288, 5410.323709536308, 5417.133258678593, 5427.755750991294, 5186.677397263674, 5288.788448462018, 5297.841064768063, 5303.496167864201, 5317.468253174651, 5023.422306434661, 5034.672746271481, 5035.345405097314, 5048.570871475818, 5065.721385323843, 3898.0, 3901.297766402075, 3902.902427439337, 3917.2361389529906, 3929.017745563609, 4875.658703890694, 5297.761600728054, 5373.919391209057, 5389.919151212814, 5435.565154787529, 4819.662623616313, 4970.25446183061, 5009.974950125226, 5018.222175562793, 5020.849374518624, 4961.677490963076, 4971.627127965345, 4985.52637499437, 4987.625928055338, 4994.101061808909, 4680.742559159143, 4735.431748190239, 4788.569028787426, 4911.582515486224, 4915.877103072452, 4946.304264175961, 5019.171836646912, 5031.22016087507, 5036.496350364934, 5049.444561098203, 4900.926486102782, 4901.754912254444, 4906.509349065065, 4937.839607692261, 4940.827071052496], "value": 3858.345282933167, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [603.8822429626225, 641.5348872067755, 687.5530904911807, 691.7509696509255, 708.4367927497639, 11108.389038602883, 11681.941590292046, 11822.822657660143, 11997.280163190215, 12018.519259229632, 10348.896511034887, 10539.262251642389, 10540.894591054088, 10564.788704225912, 10582.788344233111, 633.7338317906467, 769.7960040589248, 791.1929831571807, 811.2860682599304, 811.3995643224031, 803.9397045221632, 811.2982270336175, 812.2851890336525, 812.4231795425255, 812.6911773526082, 851.4593233296839, 853.4452605806244, 854.8931383577053, 856.8843206167181, 856.9228769410752, 661.6890061671007, 807.511455569378, 831.3266254333948, 845.9154084591553, 847.2205570874779, 606.7663949379521, 606.9241344831896, 609.3175643279511, 610.795383546508, 611.3550204534215, 11600.6519804406, 11646.883531164665, 11654.417279136009, 11660.0, 11677.240979336317, 11323.20737548372, 11376.033037191848, 11790.469428875722, 12068.155229133965, 12243.571474998333, 9334.579943902541, 9411.858822117674, 9465.195458386046, 9472.0, 9613.375130616558, 3280.950785738216, 3329.6836800503916, 3357.731381489475, 3441.8623255069765, 3444.50054742061, 40960.795196024126, 41581.58418415808, 42049.57950420487, 42146.789266053784, 42428.151436971086, 9333.626654933862, 9533.38033027865, 9552.856707149398, 9622.853154522993, 9906.801863962824, 16648.916755416387, 16738.0, 16774.49676509707, 16834.831651683573, 16852.15739213059, 6299.842503937347, 6360.618362898241, 6490.902636460457, 6618.86762264752, 6781.898271525931, 3432.1076520104452, 3456.827158642058, 3482.164280572644, 3511.367953768295, 3536.2220311531423, 2776.1255204610484, 2815.042885418967, 2823.68939416664, 2826.462972035348, 2828.37775689348, 488.83135318315834, 499.03436849695953, 512.1779543832171, 514.2517636838392, 517.0976645753185, 381.90203165898043, 480.41702589966144, 486.50619621084627, 543.8667526455964, 556.4407770190933, 7167.641617919083, 7245.456590755714, 7281.708731650675, 7318.0, 7460.253974602496, 501.7706618783994, 541.8103663717667, 560.5963706131579, 568.1165787200943, 577.9624324418984, 3400.247634296855, 3480.843362048714, 3492.046116106318, 3504.859805607798, 3512.3853325667906, 48114.27828582574, 48517.27224091641, 49204.75397622989, 50340.0, 50661.493385065674, 44752.55247447549, 44782.32826507605, 45227.0, 45919.0, 46247.76876115665, 41196.38205426921, 41333.58666413297, 41538.584614154075, 41608.0, 41804.790976044926, 6524.6411447368955, 6693.230278518033, 6748.291429399842, 6770.593764374154, 6826.146731658543, 28232.576511351934, 29112.708872911, 29143.7085629141, 29187.270318242216, 29467.410651786417, 35033.29933401369, 36695.88085012697, 37345.253094937405, 37456.063598409164, 37663.05842353963, 8771.868421973548, 8836.248918841971, 8976.685815996409, 9006.59470323824, 9209.585568649562, 9164.334743256506, 9313.767155821159, 9322.533873306444, 9414.388064775767, 9488.95255523718, 8858.329240523366, 8888.200061994452, 9042.231410330196, 9117.270618350383, 9153.221976132103, 8601.655933762579, 8725.781855453664, 8773.956130219309, 8813.074627164055, 8874.29005679557, 8559.914400855912, 8641.95679021626, 8730.0, 8748.431351962103, 8780.692675756318, 7595.506292090997, 7664.4634875560405, 7692.461527693008, 7699.8075048122, 8187.0, 7697.807554811175, 7953.761387158394, 8000.51996880189, 8136.308413784658, 8236.217559331853], "value": 5453.130681173048, "unit": "score"}], "name": "dromaeo_css", "value": 6197.4324490844165, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 115.0, 108.0, 113.0, 113.0, 115.0, 102.0, 112.0, 114.0, 113.0], "value": 111.9, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 138.0, 156.0, 183.0, 144.0, 159.0, 161.0, 135.0, 196.0, 135.0], "value": 156.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 160.0, 162.0, 163.0, 161.0, 162.0, 163.0, 162.0, 161.0, 161.0], "value": 161.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 110.0, 116.0, 76.0, 76.0, 77.0, 114.0, 102.0, 77.0], "value": 90.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 146.0, 94.0, 94.0, 94.0, 143.0, 93.0, 94.0, 148.0], "value": 109.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 116.0, 116.0, 117.0, 116.0, 117.0, 117.0], "value": 116.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 145.0, 144.0, 146.0, 146.0, 146.0, 145.0, 147.0, 146.0, 145.0], "value": 145.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 94.0, 94.0, 94.0, 95.0, 95.0, 94.0, 94.0, 94.0], "value": 94.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 69.0, 69.0, 69.0, 69.0, 69.0, 69.0, 86.0, 67.0, 67.0], "value": 70.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 66.0, 65.0, 66.0, 65.0, 66.0, 66.0, 66.0, 65.0, 66.0], "value": 65.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 81.0, 80.0, 81.0, 84.0, 81.0, 81.0, 82.0, 82.0, 82.0], "value": 81.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [138.0, 132.0, 132.0, 140.0, 130.0, 131.0, 130.0, 134.0, 166.0, 133.0], "value": 136.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [182.0, 185.0, 176.0, 175.0, 176.0, 176.0, 173.0, 175.0, 174.0, 175.0], "value": 176.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 72.0, 74.0, 81.0, 73.0, 73.0, 74.0, 75.0, 73.0, 73.0], "value": 74.6, "unit": "score"}], "name": "kraken", "value": 1592.1999999999998, "alertThreshold": 2.0}]} 17:48:08 INFO - Return code: 0 17:48:08 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 17:48:08 ERROR - # TBPL SUCCESS # 17:48:08 INFO - Running post-action listener: _resource_record_post_action 17:48:08 INFO - Running post-run listener: _resource_record_post_run 17:48:09 INFO - Total resource usage - Wall time: 1198s; CPU: 13.0%; Read bytes: 0; Write bytes: 518365184; Read time: 0; Write time: 485092 17:48:09 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 234672128; Read time: 0; Write time: 254252 17:48:09 INFO - run-tests - Wall time: 1182s; CPU: 13.0%; Read bytes: 0; Write bytes: 283504640; Read time: 0; Write time: 230816 17:48:09 INFO - Running post-run listener: _upload_blobber_files 17:48:09 INFO - Blob upload gear active. 17:48:09 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:48:09 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 17:48:09 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', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 17:48:09 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 Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 17:48:10 INFO - (blobuploader) - INFO - Open directory for files ... 17:48:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 17:48:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:48:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:48:10 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 17:48:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:48:10 INFO - (blobuploader) - INFO - Done attempting. 17:48:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 17:48:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:48:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:48:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 17:48:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:48:11 INFO - (blobuploader) - INFO - Done attempting. 17:48:11 INFO - (blobuploader) - INFO - Iteration through files over. 17:48:11 INFO - Return code: 0 17:48:11 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:48:11 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:48:11 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/173afd759ced995a8ae4216cb3c5edacee6a26ab67f7db026319cd6abebf65f388198391f4187d295bc8114d912862a57811949cf2b289991459a5f0bdecb35d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/791e81d6d902c8accb004595c42244c73bb9b4ca7d0c0b1942de3fef8393c54c357b3d6e1c053fd42387e8c56577200bc510a89c628ebdc46c998545b89ecc5c"} 17:48:11 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:48:11 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:48:11 INFO - Contents: 17:48:11 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/173afd759ced995a8ae4216cb3c5edacee6a26ab67f7db026319cd6abebf65f388198391f4187d295bc8114d912862a57811949cf2b289991459a5f0bdecb35d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/791e81d6d902c8accb004595c42244c73bb9b4ca7d0c0b1942de3fef8393c54c357b3d6e1c053fd42387e8c56577200bc510a89c628ebdc46c998545b89ecc5c"} 17:48:11 INFO - Running post-run listener: copy_logs_to_upload_dir 17:48:11 INFO - Copying logs to upload dir... 17:48:11 INFO - mkdir: /builds/slave/test/build/upload/logs 17:48:11 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1243.235650 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-04-29 17:48:11.286131) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-29 17:48:11.289832) ========= 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=a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/173afd759ced995a8ae4216cb3c5edacee6a26ab67f7db026319cd6abebf65f388198391f4187d295bc8114d912862a57811949cf2b289991459a5f0bdecb35d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/791e81d6d902c8accb004595c42244c73bb9b4ca7d0c0b1942de3fef8393c54c357b3d6e1c053fd42387e8c56577200bc510a89c628ebdc46c998545b89ecc5c"} build_url:https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011383 build_url: 'https://queue.taskcluster.net/v1/task/Fs2eeszsTXyfh812VCEv6A/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/173afd759ced995a8ae4216cb3c5edacee6a26ab67f7db026319cd6abebf65f388198391f4187d295bc8114d912862a57811949cf2b289991459a5f0bdecb35d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/791e81d6d902c8accb004595c42244c73bb9b4ca7d0c0b1942de3fef8393c54c357b3d6e1c053fd42387e8c56577200bc510a89c628ebdc46c998545b89ecc5c"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-29 17:48:11.319256) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 17:48:11.319640) ========= 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=a0d2d2de893abaa8702a9954000001a7-1461975751.4876-1565361415 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004365 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-29 17:48:11.403635) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-29 17:48:11.403970) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-29 17:48:11.404294) ========= ========= Total master_lag: 0.19 =========