builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-058 starttime: 1461855696.03 results: success (0) buildid: 20160428045211 builduid: 1bd39b36d92a4286987c24b728568253 revision: 7d48a5e12f18fe69f08cc46043a1d8ed64277ee5 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.027598) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.028070) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.028352) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.056764) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.057030) ========= 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=0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-28 08:01:36-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 85.6M=0s 2016-04-28 08:01:36 (85.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.083038 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.152973) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.153256) ========= 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=0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020616 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.202407) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.202719) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 7d48a5e12f18fe69f08cc46043a1d8ed64277ee5 --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 7d48a5e12f18fe69f08cc46043a1d8ed64277ee5 --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=0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-28 08:01:36,292 truncating revision to first 12 chars 2016-04-28 08:01:36,293 Setting DEBUG logging. 2016-04-28 08:01:36,293 attempt 1/10 2016-04-28 08:01:36,293 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/7d48a5e12f18?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-28 08:01:36,561 unpacking tar archive at: fx-team-7d48a5e12f18/testing/mozharness/ program finished with exit code 0 elapsedTime=0.545452 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.760912) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.761226) ========= script_repo_revision: 7d48a5e12f18fe69f08cc46043a1d8ed64277ee5 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.761608) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.761919) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-28 08:01:36.776333) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-04-28 08:01:36.776626) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:01:36 INFO - MultiFileLogger online at 20160428 08:01:36 in /builds/slave/test 08:01:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 08:01:36 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:01:36 INFO - {'append_to_log': False, 08:01:36 INFO - 'base_work_dir': '/builds/slave/test', 08:01:36 INFO - 'blob_upload_branch': 'Fx-Team', 08:01:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:01:36 INFO - 'branch': 'Fx-Team', 08:01:36 INFO - 'buildbot_json_path': 'buildprops.json', 08:01:36 INFO - 'config_files': ('talos/linux_config.py',), 08:01:36 INFO - 'default_actions': ('clobber', 08:01:36 INFO - 'read-buildbot-config', 08:01:36 INFO - 'download-and-extract', 08:01:36 INFO - 'populate-webroot', 08:01:36 INFO - 'create-virtualenv', 08:01:36 INFO - 'install', 08:01:36 INFO - 'run-tests'), 08:01:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:01:36 INFO - 'download_minidump_stackwalk': True, 08:01:36 INFO - 'download_symbols': 'ondemand', 08:01:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:01:36 INFO - 'tooltool.py': '/tools/tooltool.py', 08:01:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:01:36 INFO - '/tools/misc-python/virtualenv.py')}, 08:01:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:01:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:01:36 INFO - 'installer_path': 'installer.exe', 08:01:36 INFO - 'log_level': 'info', 08:01:36 INFO - 'log_name': 'talos', 08:01:36 INFO - 'log_to_console': True, 08:01:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:01:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:01:36 INFO - 'opt_config_files': (), 08:01:36 INFO - 'pip_index': False, 08:01:36 INFO - 'sps_profile': False, 08:01:36 INFO - 'sps_profile_interval': 0, 08:01:36 INFO - 'suite': 'dromaeojs', 08:01:36 INFO - 'system_bits': '32', 08:01:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:01:36 INFO - 'title': 'talos-linux64-ix-058', 08:01:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:01:36 INFO - 'use_talos_json': True, 08:01:36 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:01:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:01:36 INFO - 'work_dir': 'build'} 08:01:36 INFO - ##### 08:01:36 INFO - ##### Running clobber step. 08:01:36 INFO - ##### 08:01:36 INFO - Running pre-action listener: _resource_record_pre_action 08:01:36 INFO - Running main action method: clobber 08:01:36 INFO - rmtree: /builds/slave/test/build 08:01:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:01:37 INFO - Running post-action listener: _resource_record_post_action 08:01:37 INFO - ##### 08:01:37 INFO - ##### Running read-buildbot-config step. 08:01:37 INFO - ##### 08:01:37 INFO - Running pre-action listener: _resource_record_pre_action 08:01:37 INFO - Running main action method: read_buildbot_config 08:01:37 INFO - Using buildbot properties: 08:01:37 INFO - { 08:01:37 INFO - "project": "", 08:01:37 INFO - "product": "firefox", 08:01:37 INFO - "script_repo_revision": "production", 08:01:37 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 08:01:37 INFO - "repository": "", 08:01:37 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 08:01:37 INFO - "buildid": "20160428045211", 08:01:37 INFO - "pgo_build": "True", 08:01:37 INFO - "basedir": "/builds/slave/test", 08:01:37 INFO - "buildnumber": 620, 08:01:37 INFO - "slavename": "talos-linux64-ix-058", 08:01:37 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 08:01:37 INFO - "platform": "ubuntu64_hw", 08:01:37 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 08:01:37 INFO - "branch": "fx-team", 08:01:37 INFO - "repo_path": "integration/fx-team", 08:01:37 INFO - "revision": "7d48a5e12f18fe69f08cc46043a1d8ed64277ee5", 08:01:37 INFO - "stage_platform": "linux64-pgo", 08:01:37 INFO - "builduid": "1bd39b36d92a4286987c24b728568253", 08:01:37 INFO - "slavebuilddir": "test" 08:01:37 INFO - } 08:01:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2. 08:01:37 INFO - Running post-action listener: _resource_record_post_action 08:01:37 INFO - ##### 08:01:37 INFO - ##### Running download-and-extract step. 08:01:37 INFO - ##### 08:01:37 INFO - Running pre-action listener: _resource_record_pre_action 08:01:37 INFO - Running main action method: download_and_extract 08:01:37 INFO - mkdir: /builds/slave/test/build/tests 08:01:37 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')]} 08:01:37 INFO - https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 08:01:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 08:01:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 08:01:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 08:01:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 08:01:39 INFO - Downloaded 1361 bytes. 08:01:39 INFO - Reading from file /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.test_packages.json 08:01:39 INFO - Using the following test package requirements: 08:01:39 INFO - {u'common': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 08:01:39 INFO - u'cppunittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:01:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 08:01:39 INFO - u'gtest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:01:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.gtest.tests.zip'], 08:01:39 INFO - u'jittest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:01:39 INFO - u'jsshell-linux-x86_64.zip'], 08:01:39 INFO - u'mochitest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:01:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 08:01:39 INFO - u'mozbase': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'], 08:01:39 INFO - u'reftest': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:01:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.reftest.tests.zip'], 08:01:39 INFO - u'talos': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:01:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'], 08:01:39 INFO - u'web-platform': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:01:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 08:01:39 INFO - u'xpcshell': [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 08:01:39 INFO - u'firefox-48.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 08:01:39 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:01: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')]} 08:01:39 INFO - https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:01:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:01:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:01:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:01:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:01:40 INFO - Downloaded 23860699 bytes. 08:01:40 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 08:01:40 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 08:01:42 INFO - Return code: 0 08:01:42 INFO - Downloading packages: [u'firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 08:01: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')]} 08:01:42 INFO - https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:01:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:01:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:01:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip 08:01:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:01:47 INFO - Downloaded 23860699 bytes. 08:01:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 08:01:47 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 08:01:49 INFO - Return code: 0 08:01:49 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')]} 08:01:49 INFO - https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 08:01:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 08:01:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 08:01:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip 08:01:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 08:01:50 INFO - Downloaded 10840145 bytes. 08:01:50 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 08:01:50 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 08:01:51 INFO - Return code: 0 08:01: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')]} 08:01:51 INFO - https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 08:01:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 08:01:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 08:01:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 08:01:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 08:01:52 INFO - Downloaded 58357448 bytes. 08:01:52 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 08:01:52 INFO - mkdir: /builds/slave/test/properties 08:01:52 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:01:52 INFO - Writing to file /builds/slave/test/properties/build_url 08:01:52 INFO - Contents: 08:01:52 INFO - build_url:https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 08:01:53 INFO - Running post-action listener: _resource_record_post_action 08:01:53 INFO - Running post-action listener: set_extra_try_arguments 08:01:53 INFO - ##### 08:01:53 INFO - ##### Running populate-webroot step. 08:01:53 INFO - ##### 08:01:53 INFO - Running pre-action listener: _resource_record_pre_action 08:01:53 INFO - Running main action method: populate_webroot 08:01:53 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:01:53 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:01:53 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:01:53 INFO - '--tppagecycles', 08:01:53 INFO - '7'], 08:01:53 INFO - 'tests': ['tsvgm']}}, 08:01:53 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:01:53 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:01:53 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:01:53 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:01:53 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:01:53 INFO - 'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:01:53 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:01:53 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:01:53 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:01:53 INFO - 'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['damp', 'tps']}, 08:01:53 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:01:53 INFO - 'tests': ['damp', 'tps']}, 08:01:53 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['dromaeo_dom']}, 08:01:53 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:01:53 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['a11yr', 08:01:53 INFO - 'ts_paint', 08:01:53 INFO - 'tpaint', 08:01:53 INFO - 'sessionrestore', 08:01:53 INFO - 'sessionrestore_no_auto_restore', 08:01:53 INFO - 'tabpaint']}, 08:01:53 INFO - 'other-e10s': {'tests': ['a11yr', 08:01:53 INFO - 'ts_paint', 08:01:53 INFO - 'tpaint', 08:01:53 INFO - 'sessionrestore', 08:01:53 INFO - 'sessionrestore_no_auto_restore', 08:01:53 INFO - 'tabpaint']}, 08:01:53 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:01:53 INFO - 'ts_paint', 08:01:53 INFO - 'tpaint', 08:01:53 INFO - 'sessionrestore', 08:01:53 INFO - 'sessionrestore_no_auto_restore', 08:01:53 INFO - 'tabpaint']}, 08:01:53 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:01:53 INFO - 'ts_paint', 08:01:53 INFO - 'tpaint', 08:01:53 INFO - 'sessionrestore', 08:01:53 INFO - 'sessionrestore_no_auto_restore', 08:01:53 INFO - 'tabpaint']}, 08:01:53 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['a11yr', 08:01:53 INFO - 'ts_paint', 08:01:53 INFO - 'tpaint', 08:01:53 INFO - 'sessionrestore', 08:01:53 INFO - 'sessionrestore_no_auto_restore', 08:01:53 INFO - 'tabpaint']}, 08:01:53 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['a11yr', 08:01:53 INFO - 'ts_paint', 08:01:53 INFO - 'tpaint', 08:01:53 INFO - 'sessionrestore', 08:01:53 INFO - 'sessionrestore_no_auto_restore', 08:01:53 INFO - 'tabpaint']}, 08:01:53 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['tsvgx', 08:01:53 INFO - 'tsvgr_opacity', 08:01:53 INFO - 'tart', 08:01:53 INFO - 'tscrollx', 08:01:53 INFO - 'cart']}, 08:01:53 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:01:53 INFO - 'tsvgr_opacity', 08:01:53 INFO - 'tart', 08:01:53 INFO - 'tscrollx', 08:01:53 INFO - 'cart']}, 08:01:53 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:01:53 INFO - 'talos_options': ['--disable-e10s'], 08:01:53 INFO - 'tests': ['tp5o']}, 08:01:53 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:01:53 INFO - 'tests': ['tp5o']}, 08:01:53 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:01:53 INFO - 'talos_options': ['--disable-e10s', 08:01:53 INFO - '--xperf_path', 08:01:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:01:53 INFO - 'tests': ['tp5n']}, 08:01:53 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:01:53 INFO - 'talos_options': ['--xperf_path', 08:01:53 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:01:53 INFO - 'tests': ['tp5n']}}, 08:01:53 INFO - 'talos.zip': {'path': '', 08:01:53 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:01:53 INFO - Running post-action listener: _resource_record_post_action 08:01:53 INFO - ##### 08:01:53 INFO - ##### Running create-virtualenv step. 08:01:53 INFO - ##### 08:01:53 INFO - Running pre-action listener: _resource_record_pre_action 08:01:53 INFO - Running main action method: create_virtualenv 08:01:53 INFO - Creating virtualenv /builds/slave/test/build/venv 08:01:53 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 08:01:53 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:01:53 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:01:53 INFO - Using real prefix '/usr' 08:01:53 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:01:54 INFO - Installing distribute.............................................................................................................................................................................................done. 08:01:55 INFO - Installing pip.................done. 08:01:56 INFO - Return code: 0 08:01:56 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:01:56 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')]} 08:01:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:01:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:01:56 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')]} 08:01:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:01:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:01:56 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 0x7f854c964f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27838a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x284e9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, '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': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', '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 08:01:56 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 08:01:56 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 08:01:56 INFO - Using env: {'DISPLAY': ':0', 08:01:56 INFO - 'HOME': '/home/cltbld', 08:01:56 INFO - 'LANG': 'en_US.UTF-8', 08:01:56 INFO - 'LANGUAGE': 'en_US:en', 08:01:56 INFO - 'LOGNAME': 'cltbld', 08:01:56 INFO - 'MAIL': '/var/mail/cltbld', 08:01:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:01:56 INFO - 'MOZ_NO_REMOTE': '1', 08:01:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:01:56 INFO - 'NO_EM_RESTART': '1', 08:01:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:01:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:01:56 INFO - 'PWD': '/builds/slave/test', 08:01:56 INFO - 'SHELL': '/bin/bash', 08:01:56 INFO - 'SHLVL': '1', 08:01:56 INFO - 'TERM': 'linux', 08:01:56 INFO - 'TMOUT': '86400', 08:01:56 INFO - 'USER': 'cltbld', 08:01:56 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:01:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:01:56 INFO - '_': '/tools/buildbot/bin/python'} 08:01:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:01:56 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 08:01:56 INFO - Cleaning up... 08:01:56 INFO - Return code: 0 08:01:56 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 08:01:56 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')]} 08:01:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:01:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:01:56 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')]} 08:01:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:01:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:01:56 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 0x7f854c964f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27838a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x284e9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, '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': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', '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 08:01:56 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 08:01:56 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 08:01:56 INFO - Using env: {'DISPLAY': ':0', 08:01:56 INFO - 'HOME': '/home/cltbld', 08:01:56 INFO - 'LANG': 'en_US.UTF-8', 08:01:56 INFO - 'LANGUAGE': 'en_US:en', 08:01:56 INFO - 'LOGNAME': 'cltbld', 08:01:56 INFO - 'MAIL': '/var/mail/cltbld', 08:01:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:01:56 INFO - 'MOZ_NO_REMOTE': '1', 08:01:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:01:56 INFO - 'NO_EM_RESTART': '1', 08:01:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:01:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:01:56 INFO - 'PWD': '/builds/slave/test', 08:01:56 INFO - 'SHELL': '/bin/bash', 08:01:56 INFO - 'SHLVL': '1', 08:01:56 INFO - 'TERM': 'linux', 08:01:56 INFO - 'TMOUT': '86400', 08:01:56 INFO - 'USER': 'cltbld', 08:01:56 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:01:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:01:56 INFO - '_': '/tools/buildbot/bin/python'} 08:01:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:01:56 INFO - Downloading/unpacking psutil>=0.7.1 08:01: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 08:01: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 08:01: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 08:01: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 08:01: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 08:01: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 08:01:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:01:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:01:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:01:58 INFO - Installing collected packages: psutil 08:01:58 INFO - Running setup.py install for psutil 08:01:58 INFO - building 'psutil._psutil_linux' extension 08:01:58 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 08:01:58 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 08:01:58 INFO - building 'psutil._psutil_posix' extension 08:01:58 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 08:01:58 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 08:01:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:01:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:01:58 INFO - Successfully installed psutil 08:01:58 INFO - Cleaning up... 08:01:58 INFO - Return code: 0 08:01:58 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 08:01:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:01:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:01:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:01:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:01:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:01:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:01:58 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 0x7f854c964f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27838a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x284e9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, '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': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', '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 08:01:58 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 08:01:58 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 08:01:58 INFO - Using env: {'DISPLAY': ':0', 08:01:58 INFO - 'HOME': '/home/cltbld', 08:01:58 INFO - 'LANG': 'en_US.UTF-8', 08:01:58 INFO - 'LANGUAGE': 'en_US:en', 08:01:58 INFO - 'LOGNAME': 'cltbld', 08:01:58 INFO - 'MAIL': '/var/mail/cltbld', 08:01:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:01:58 INFO - 'MOZ_NO_REMOTE': '1', 08:01:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:01:58 INFO - 'NO_EM_RESTART': '1', 08:01:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:01:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:01:58 INFO - 'PWD': '/builds/slave/test', 08:01:58 INFO - 'SHELL': '/bin/bash', 08:01:58 INFO - 'SHLVL': '1', 08:01:58 INFO - 'TERM': 'linux', 08:01:58 INFO - 'TMOUT': '86400', 08:01:58 INFO - 'USER': 'cltbld', 08:01:58 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:01:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:01:58 INFO - '_': '/tools/buildbot/bin/python'} 08:01:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:01:59 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 08:01:59 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 08:01:59 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 08:01:59 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 08:01:59 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 08:01:59 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 08:01:59 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 08:02:01 INFO - Downloading mozsystemmonitor-0.0.tar.gz 08:02:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:02:01 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 08:02:01 INFO - Installing collected packages: mozsystemmonitor 08:02:01 INFO - Running setup.py install for mozsystemmonitor 08:02:01 INFO - Successfully installed mozsystemmonitor 08:02:01 INFO - Cleaning up... 08:02:01 INFO - Return code: 0 08:02:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:02:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:02:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:02:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:02:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:02:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:01 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 0x7f854c964f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27838a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x284e9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, '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': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', '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 08:02:01 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 08:02:01 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 08:02:01 INFO - Using env: {'DISPLAY': ':0', 08:02:01 INFO - 'HOME': '/home/cltbld', 08:02:01 INFO - 'LANG': 'en_US.UTF-8', 08:02:01 INFO - 'LANGUAGE': 'en_US:en', 08:02:01 INFO - 'LOGNAME': 'cltbld', 08:02:01 INFO - 'MAIL': '/var/mail/cltbld', 08:02:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:02:01 INFO - 'MOZ_NO_REMOTE': '1', 08:02:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:02:01 INFO - 'NO_EM_RESTART': '1', 08:02:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:02:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:02:01 INFO - 'PWD': '/builds/slave/test', 08:02:01 INFO - 'SHELL': '/bin/bash', 08:02:01 INFO - 'SHLVL': '1', 08:02:01 INFO - 'TERM': 'linux', 08:02:01 INFO - 'TMOUT': '86400', 08:02:01 INFO - 'USER': 'cltbld', 08:02:01 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:02:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:02:01 INFO - '_': '/tools/buildbot/bin/python'} 08:02:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:02:01 INFO - Downloading/unpacking blobuploader==1.2.4 08:02:01 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 08:02:01 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 08:02:01 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 08:02:01 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 08:02:01 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 08:02:01 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 08:02:03 INFO - Downloading blobuploader-1.2.4.tar.gz 08:02:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:02:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:02:03 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 08:02:03 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 08:02:03 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 08:02:03 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 08:02:03 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 08:02:03 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 08:02:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:02:03 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:02:03 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 08:02:03 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 08:02:03 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 08:02:03 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 08:02:03 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 08:02:03 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 08:02:04 INFO - Downloading docopt-0.6.1.tar.gz 08:02:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:02:04 INFO - Installing collected packages: blobuploader, requests, docopt 08:02:04 INFO - Running setup.py install for blobuploader 08:02:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:02:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:02:04 INFO - Running setup.py install for requests 08:02:04 INFO - Running setup.py install for docopt 08:02:04 INFO - Successfully installed blobuploader requests docopt 08:02:04 INFO - Cleaning up... 08:02:04 INFO - Return code: 0 08:02:04 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:02: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')]} 08:02:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:02:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02: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')]} 08:02:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:02:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:04 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 0x7f854c964f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27838a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x284e9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, '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': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', '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 08:02:04 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 08:02:04 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 08:02:04 INFO - Using env: {'DISPLAY': ':0', 08:02:04 INFO - 'HOME': '/home/cltbld', 08:02:04 INFO - 'LANG': 'en_US.UTF-8', 08:02:04 INFO - 'LANGUAGE': 'en_US:en', 08:02:04 INFO - 'LOGNAME': 'cltbld', 08:02:04 INFO - 'MAIL': '/var/mail/cltbld', 08:02:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:02:04 INFO - 'MOZ_NO_REMOTE': '1', 08:02:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:02:04 INFO - 'NO_EM_RESTART': '1', 08:02:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:02:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:02:04 INFO - 'PWD': '/builds/slave/test', 08:02:04 INFO - 'SHELL': '/bin/bash', 08:02:04 INFO - 'SHLVL': '1', 08:02:04 INFO - 'TERM': 'linux', 08:02:04 INFO - 'TMOUT': '86400', 08:02:04 INFO - 'USER': 'cltbld', 08:02:04 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:02:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:02:04 INFO - '_': '/tools/buildbot/bin/python'} 08:02:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:02:04 INFO - Running setup.py (path:/tmp/pip-OoVyWE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:02:05 INFO - Running setup.py (path:/tmp/pip-oVmrFd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:02:05 INFO - Running setup.py (path:/tmp/pip-KZs528-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:02:05 INFO - Running setup.py (path:/tmp/pip-LgD0Ty-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:02:05 INFO - Running setup.py (path:/tmp/pip-O8aSn0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:02:05 INFO - Running setup.py (path:/tmp/pip-laeWed-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:02:05 INFO - Running setup.py (path:/tmp/pip-7JkkQ4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:02:05 INFO - Running setup.py (path:/tmp/pip-PgO4CS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:02:05 INFO - Running setup.py (path:/tmp/pip-RXvEEg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:02:05 INFO - Running setup.py (path:/tmp/pip-QEMvvr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:02:05 INFO - Running setup.py (path:/tmp/pip-ezJQcY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:02:05 INFO - Running setup.py (path:/tmp/pip-e3acag-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:02:05 INFO - Running setup.py (path:/tmp/pip-D331EU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:02:05 INFO - Running setup.py (path:/tmp/pip-djXYO0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:02:05 INFO - Running setup.py (path:/tmp/pip-NWZeaf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:02:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:02:06 INFO - Running setup.py (path:/tmp/pip-8BTr3B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:02:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:02:06 INFO - Running setup.py (path:/tmp/pip-tI_zzX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:02:06 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:02:06 INFO - Running setup.py install for manifestparser 08:02:06 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:02:06 INFO - Running setup.py install for mozcrash 08:02:06 INFO - Running setup.py install for mozdebug 08:02:06 INFO - Running setup.py install for mozdevice 08:02:06 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:02:06 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:02:06 INFO - Running setup.py install for mozfile 08:02:06 INFO - Running setup.py install for mozhttpd 08:02:06 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:02:06 INFO - Running setup.py install for mozinfo 08:02:06 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:02:06 INFO - Running setup.py install for mozInstall 08:02:07 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Running setup.py install for mozleak 08:02:07 INFO - Running setup.py install for mozlog 08:02:07 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Running setup.py install for moznetwork 08:02:07 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Running setup.py install for mozprocess 08:02:07 INFO - Running setup.py install for mozprofile 08:02:07 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Running setup.py install for mozrunner 08:02:07 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Running setup.py install for mozscreenshot 08:02:07 INFO - Running setup.py install for moztest 08:02:07 INFO - Running setup.py install for mozversion 08:02:07 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:02:07 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:02:07 INFO - Cleaning up... 08:02:08 INFO - Return code: 0 08:02:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:02:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:02:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:02:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:02:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:02:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:08 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 0x7f854c964f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27838a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x284e9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, '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': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', '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 08:02:08 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 08:02:08 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 08:02:08 INFO - Using env: {'DISPLAY': ':0', 08:02:08 INFO - 'HOME': '/home/cltbld', 08:02:08 INFO - 'LANG': 'en_US.UTF-8', 08:02:08 INFO - 'LANGUAGE': 'en_US:en', 08:02:08 INFO - 'LOGNAME': 'cltbld', 08:02:08 INFO - 'MAIL': '/var/mail/cltbld', 08:02:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:02:08 INFO - 'MOZ_NO_REMOTE': '1', 08:02:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:02:08 INFO - 'NO_EM_RESTART': '1', 08:02:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:02:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:02:08 INFO - 'PWD': '/builds/slave/test', 08:02:08 INFO - 'SHELL': '/bin/bash', 08:02:08 INFO - 'SHLVL': '1', 08:02:08 INFO - 'TERM': 'linux', 08:02:08 INFO - 'TMOUT': '86400', 08:02:08 INFO - 'USER': 'cltbld', 08:02:08 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:02:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:02:08 INFO - '_': '/tools/buildbot/bin/python'} 08:02:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:02:08 INFO - Running setup.py (path:/tmp/pip-Pvlwxh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:02:08 INFO - Running setup.py (path:/tmp/pip-n0GyvR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:02:08 INFO - Running setup.py (path:/tmp/pip-YcxDXC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:02:08 INFO - Running setup.py (path:/tmp/pip-auMEFb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:02:08 INFO - Running setup.py (path:/tmp/pip-8r5n4H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:02:08 INFO - Running setup.py (path:/tmp/pip-qfIlsG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:02:08 INFO - Running setup.py (path:/tmp/pip-qQRz8K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:02:08 INFO - Running setup.py (path:/tmp/pip-p7ngB_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:02:08 INFO - Running setup.py (path:/tmp/pip-Gn_lDj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:02:08 INFO - Running setup.py (path:/tmp/pip-xyP5mr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:02:08 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)) 08:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:02:08 INFO - Running setup.py (path:/tmp/pip-zZvwgM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:02:09 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)) 08:02:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:02:09 INFO - Running setup.py (path:/tmp/pip-MbzOrM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:02:09 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)) 08:02:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:02:09 INFO - Running setup.py (path:/tmp/pip-a7xbDc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:02:09 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)) 08:02:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:02:09 INFO - Running setup.py (path:/tmp/pip-H6zBLs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:02:09 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)) 08:02:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:02:09 INFO - Running setup.py (path:/tmp/pip-JWXA0I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:02:09 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)) 08:02:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:02:09 INFO - Running setup.py (path:/tmp/pip-hkMkXs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:02:09 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)) 08:02:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:02:09 INFO - Running setup.py (path:/tmp/pip-7cG3XC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:02:09 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)) 08:02:09 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)) 08:02:09 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)) 08:02:09 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)) 08:02:09 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)) 08:02:09 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)) 08:02:09 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:02: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 08:02: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 08:02: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 08:02: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 08:02: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 08:02: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 08:02:11 INFO - Downloading blessings-1.6.tar.gz 08:02:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:02:11 INFO - Installing collected packages: blessings 08:02:11 INFO - Running setup.py install for blessings 08:02:11 INFO - Successfully installed blessings 08:02:11 INFO - Cleaning up... 08:02:11 INFO - Return code: 0 08:02:11 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:02:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:02:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:02:11 INFO - Reading from file tmpfile_stdout 08:02:11 INFO - Current package versions: 08:02:11 INFO - argparse == 1.2.1 08:02:11 INFO - blessings == 1.6 08:02:11 INFO - blobuploader == 1.2.4 08:02:11 INFO - docopt == 0.6.1 08:02:11 INFO - manifestparser == 1.1 08:02:11 INFO - mozInstall == 1.12 08:02:11 INFO - mozcrash == 0.17 08:02:11 INFO - mozdebug == 0.1 08:02:11 INFO - mozdevice == 0.48 08:02:11 INFO - mozfile == 1.2 08:02:11 INFO - mozhttpd == 0.7 08:02:11 INFO - mozinfo == 0.9 08:02:11 INFO - mozleak == 0.1 08:02:11 INFO - mozlog == 3.1 08:02:11 INFO - moznetwork == 0.27 08:02:11 INFO - mozprocess == 0.22 08:02:11 INFO - mozprofile == 0.28 08:02:11 INFO - mozrunner == 6.11 08:02:11 INFO - mozscreenshot == 0.1 08:02:11 INFO - mozsystemmonitor == 0.0 08:02:11 INFO - moztest == 0.7 08:02:11 INFO - mozversion == 1.4 08:02:11 INFO - psutil == 3.1.1 08:02:11 INFO - requests == 1.2.3 08:02:11 INFO - wsgiref == 0.1.2 08:02:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:02:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:02:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:02:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:02:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:02:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:11 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 0x7f854c964f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27838a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x284e9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, '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': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', '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 08:02:11 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 08:02:11 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 08:02:11 INFO - Using env: {'DISPLAY': ':0', 08:02:11 INFO - 'HOME': '/home/cltbld', 08:02:11 INFO - 'LANG': 'en_US.UTF-8', 08:02:11 INFO - 'LANGUAGE': 'en_US:en', 08:02:11 INFO - 'LOGNAME': 'cltbld', 08:02:11 INFO - 'MAIL': '/var/mail/cltbld', 08:02:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:02:11 INFO - 'MOZ_NO_REMOTE': '1', 08:02:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:02:11 INFO - 'NO_EM_RESTART': '1', 08:02:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:02:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:02:11 INFO - 'PWD': '/builds/slave/test', 08:02:11 INFO - 'SHELL': '/bin/bash', 08:02:11 INFO - 'SHLVL': '1', 08:02:11 INFO - 'TERM': 'linux', 08:02:11 INFO - 'TMOUT': '86400', 08:02:11 INFO - 'USER': 'cltbld', 08:02:11 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:02:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:02:11 INFO - '_': '/tools/buildbot/bin/python'} 08:02:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:02:12 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)) 08:02:12 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)) 08:02:12 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)) 08:02:12 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)) 08:02:12 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)) 08:02:12 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)) 08:02:12 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)) 08:02:12 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)) 08:02:12 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)) 08:02:12 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)) 08:02:12 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)) 08:02:12 INFO - Cleaning up... 08:02:12 INFO - Return code: 0 08:02:12 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:02:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:02:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:02:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:02:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:02:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:12 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 0x7f854c964f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27838a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x284e9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, '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': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', '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 08:02:12 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 08:02:12 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 08:02:12 INFO - Using env: {'DISPLAY': ':0', 08:02:12 INFO - 'HOME': '/home/cltbld', 08:02:12 INFO - 'LANG': 'en_US.UTF-8', 08:02:12 INFO - 'LANGUAGE': 'en_US:en', 08:02:12 INFO - 'LOGNAME': 'cltbld', 08:02:12 INFO - 'MAIL': '/var/mail/cltbld', 08:02:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:02:12 INFO - 'MOZ_NO_REMOTE': '1', 08:02:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:02:12 INFO - 'NO_EM_RESTART': '1', 08:02:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:02:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:02:12 INFO - 'PWD': '/builds/slave/test', 08:02:12 INFO - 'SHELL': '/bin/bash', 08:02:12 INFO - 'SHLVL': '1', 08:02:12 INFO - 'TERM': 'linux', 08:02:12 INFO - 'TMOUT': '86400', 08:02:12 INFO - 'USER': 'cltbld', 08:02:12 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:02:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:02:12 INFO - '_': '/tools/buildbot/bin/python'} 08:02:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:02:12 INFO - Downloading/unpacking jsonschema 08:02:12 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 08:02:12 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 08:02:12 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 08:02:12 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 08:02:12 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 08:02:12 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 08:02:14 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:02:14 INFO - Downloading/unpacking functools32 (from jsonschema) 08:02:14 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 08:02:14 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 08:02:14 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 08:02:14 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 08:02:14 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 08:02:14 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 08:02:14 INFO - Downloading functools32-3.2.3-2.tar.gz 08:02:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:02:14 INFO - warning: no files found matching '*.txt' 08:02:14 INFO - no previously-included directories found matching 'build' 08:02:14 INFO - no previously-included directories found matching 'dist' 08:02:14 INFO - no previously-included directories found matching '.git*' 08:02:14 INFO - Installing collected packages: jsonschema, functools32 08:02:14 INFO - Running setup.py install for functools32 08:02:14 INFO - warning: no files found matching '*.txt' 08:02:14 INFO - no previously-included directories found matching 'build' 08:02:14 INFO - no previously-included directories found matching 'dist' 08:02:14 INFO - no previously-included directories found matching '.git*' 08:02:14 INFO - Successfully installed jsonschema functools32 08:02:14 INFO - Cleaning up... 08:02:14 INFO - Return code: 0 08:02:14 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 08:02:14 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')]} 08:02:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:02:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:14 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')]} 08:02:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:02:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:02:14 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 0x7f854c964f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x27838a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x284e9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, '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': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', '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 08:02:14 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 08:02:14 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 08:02:14 INFO - Using env: {'DISPLAY': ':0', 08:02:14 INFO - 'HOME': '/home/cltbld', 08:02:14 INFO - 'LANG': 'en_US.UTF-8', 08:02:14 INFO - 'LANGUAGE': 'en_US:en', 08:02:14 INFO - 'LOGNAME': 'cltbld', 08:02:14 INFO - 'MAIL': '/var/mail/cltbld', 08:02:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:02:14 INFO - 'MOZ_NO_REMOTE': '1', 08:02:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:02:14 INFO - 'NO_EM_RESTART': '1', 08:02:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:02:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:02:14 INFO - 'PWD': '/builds/slave/test', 08:02:14 INFO - 'SHELL': '/bin/bash', 08:02:14 INFO - 'SHLVL': '1', 08:02:14 INFO - 'TERM': 'linux', 08:02:14 INFO - 'TMOUT': '86400', 08:02:14 INFO - 'USER': 'cltbld', 08:02:14 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:02:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:02:14 INFO - '_': '/tools/buildbot/bin/python'} 08:02:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:02:14 INFO - Downloading/unpacking flake8 08:02:14 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 08:02:14 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 08:02:14 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 08:02:14 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 08:02:14 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 08:02:14 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 08:02:16 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 08:02:16 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 08:02:16 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 08:02:16 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 08:02:16 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 08:02:16 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 08:02:16 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 08:02:16 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 08:02:16 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 08:02:16 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 08:02:16 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 08:02:16 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 08:02:16 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 08:02:16 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 08:02:16 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 08:02:16 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 08:02:17 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 08:02:17 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 08:02:17 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 08:02:17 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 08:02:17 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 08:02:17 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 08:02:17 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 08:02:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 08:02:17 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:02:17 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:02:17 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:02:17 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:02:17 INFO - no previously-included directories found matching 'docs/_build' 08:02:17 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 08:02:17 INFO - Running setup.py install for pep8 08:02:17 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:02:17 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:02:17 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:02:17 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:02:17 INFO - no previously-included directories found matching 'docs/_build' 08:02:17 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 08:02:17 INFO - Successfully installed flake8 mccabe pyflakes pep8 08:02:17 INFO - Cleaning up... 08:02:17 INFO - Return code: 0 08:02:17 INFO - Running post-action listener: _resource_record_post_action 08:02:17 INFO - Running post-action listener: _start_resource_monitoring 08:02:17 INFO - Starting resource monitoring. 08:02:17 INFO - ##### 08:02:17 INFO - ##### Running install step. 08:02:17 INFO - ##### 08:02:17 INFO - Running pre-action listener: _resource_record_pre_action 08:02:17 INFO - Running main action method: install 08:02:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:02:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:02:17 INFO - Reading from file tmpfile_stdout 08:02:17 INFO - Detecting whether we're running mozinstall >=1.0... 08:02:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:02:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:02:17 INFO - Reading from file tmpfile_stdout 08:02:17 INFO - Output received: 08:02:17 INFO - Usage: mozinstall [options] installer 08:02:17 INFO - Options: 08:02:17 INFO - -h, --help show this help message and exit 08:02:17 INFO - -d DEST, --destination=DEST 08:02:17 INFO - Directory to install application into. [default: 08:02:17 INFO - "/builds/slave/test"] 08:02:17 INFO - --app=APP Application being installed. [default: firefox] 08:02:17 INFO - mkdir: /builds/slave/test/build/application 08:02:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:02:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 08:02:34 INFO - Reading from file tmpfile_stdout 08:02:34 INFO - Output received: 08:02:34 INFO - /builds/slave/test/build/application/firefox/firefox 08:02:34 INFO - Running post-action listener: _resource_record_post_action 08:02:34 INFO - ##### 08:02:34 INFO - ##### Running run-tests step. 08:02:34 INFO - ##### 08:02:34 INFO - Running pre-action listener: _resource_record_pre_action 08:02:34 INFO - Running main action method: run_tests 08:02:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:02:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:02:34 INFO - Python 2.7.3 08:02:34 INFO - Return code: 0 08:02:34 INFO - grabbing minidump binary from tooltool 08:02:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 08:02:34 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 0x28dd810>, '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 0x28de710>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x28deba0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:02:34 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 08:02:34 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 08:02:34 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:02:34 INFO - Return code: 0 08:02:34 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:02:34 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:02:34 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:02:34 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:02:34 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:02:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 08:02:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 08:02:35 INFO - Return code: 0 08:02:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-058', '--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 08:02:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-058 --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 08:02:35 INFO - Using env: {'DISPLAY': ':0', 08:02:35 INFO - 'HOME': '/home/cltbld', 08:02:35 INFO - 'LANG': 'en_US.UTF-8', 08:02:35 INFO - 'LANGUAGE': 'en_US:en', 08:02:35 INFO - 'LOGNAME': 'cltbld', 08:02:35 INFO - 'MAIL': '/var/mail/cltbld', 08:02:35 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:02:35 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:02:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:02:35 INFO - 'MOZ_NO_REMOTE': '1', 08:02:35 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:02:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:02:35 INFO - 'NO_EM_RESTART': '1', 08:02:35 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:02:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:02:35 INFO - 'PWD': '/builds/slave/test', 08:02:35 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:02:35 INFO - 'SHELL': '/bin/bash', 08:02:35 INFO - 'SHLVL': '1', 08:02:35 INFO - 'TERM': 'linux', 08:02:35 INFO - 'TMOUT': '86400', 08:02:35 INFO - 'USER': 'cltbld', 08:02:35 INFO - 'XDG_SESSION_COOKIE': '0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278', 08:02:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:02:35 INFO - '_': '/tools/buildbot/bin/python'} 08:02:35 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-058', '--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 08:02:35 INFO - mozversion application_buildid: 20160428045211 08:02:35 INFO - mozversion application_changeset: 7d48a5e12f18fe69f08cc46043a1d8ed64277ee5 08:02:35 INFO - mozversion application_display_name: Nightly 08:02:35 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:02:35 INFO - mozversion application_name: Firefox 08:02:35 INFO - mozversion application_remotingname: firefox 08:02:35 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 08:02:35 INFO - mozversion application_vendor: Mozilla 08:02:35 INFO - mozversion application_version: 48.0a1 08:02:35 INFO - mozversion platform_buildid: 20160428045211 08:02:35 INFO - mozversion platform_changeset: 7d48a5e12f18fe69f08cc46043a1d8ed64277ee5 08:02:35 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 08:02:35 INFO - mozversion platform_version: 48.0a1 08:02:35 INFO - using testdate: 1461855755 08:02:35 INFO - actual date: 1461855755 08:02:35 INFO - starting webserver on 'localhost:39164' 08:02:35 INFO - SUITE-START | Running 2 tests 08:02:35 INFO - TEST-START | dromaeo_css 08:02:35 INFO - operating with platform_type : linux_ 08:02:35 INFO - Initialising browser for dromaeo_css test... 08:02:35 INFO - TEST-INFO | started process 12756 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpA_Xtvs/profile http://localhost:39164/getInfo.html) 08:02:39 INFO - PROCESS | 12756 | __metrics Screen width/height:1600/1200 08:02:39 INFO - PROCESS | 12756 | colorDepth:24 08:02:39 INFO - PROCESS | 12756 | Browser inner width/height: 1024/697 08:02:39 INFO - PROCESS | 12756 | __metrics 08:02:40 ERROR - PROCESS | 12756 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 08:02:41 INFO - TEST-INFO | 12756: exit 0 08:02:41 INFO - Browser initialized. 08:02:41 INFO - Running cycle 1/1 for dromaeo_css test... 08:02:41 INFO - TEST-INFO | started process 12839 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpA_Xtvs/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:02:53 INFO - PROCESS | 12839 | RSS: Main: 154304512 08:02:53 INFO - PROCESS | 12839 | 08:03:44 INFO - PROCESS | 12839 | 1461855824481 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] 08:05:51 INFO - PROCESS | 12839 | Cycle 1(1): loaded http://localhost:39164/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39164/tests/dromaeo/cssquery-ext.html) 08:05:52 INFO - PROCESS | 12839 | RSS: Main: 241836032 08:05:52 INFO - PROCESS | 12839 | 08:08:55 INFO - PROCESS | 12839 | Cycle 1(1): loaded http://localhost:39164/tests/dromaeo/cssquery-ext.html (next: http://localhost:39164/tests/dromaeo/cssquery-jquery.html) 08:08:55 INFO - PROCESS | 12839 | RSS: Main: 235700224 08:08:55 INFO - PROCESS | 12839 | 08:11:57 INFO - PROCESS | 12839 | Cycle 1(1): loaded http://localhost:39164/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39164/tests/dromaeo/cssquery-mootools.html) 08:11:58 INFO - PROCESS | 12839 | RSS: Main: 233885696 08:11:58 INFO - PROCESS | 12839 | 08:15:00 INFO - PROCESS | 12839 | Cycle 1(1): loaded http://localhost:39164/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39164/tests/dromaeo/cssquery-prototype.html) 08:15:00 INFO - PROCESS | 12839 | RSS: Main: 229507072 08:15:00 INFO - PROCESS | 12839 | 08:18:03 INFO - PROCESS | 12839 | Cycle 1(1): loaded http://localhost:39164/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39164/tests/dromaeo/cssquery-yui.html) 08:18:04 INFO - PROCESS | 12839 | RSS: Main: 222232576 08:18:04 INFO - PROCESS | 12839 | 08:21:06 INFO - PROCESS | 12839 | Cycle 1(1): loaded http://localhost:39164/tests/dromaeo/cssquery-yui.html (next: http://localhost:39164/tests/dromaeo/cssquery-dojo.html) 08:21:06 INFO - PROCESS | 12839 | RSS: Main: 269684736 08:21:06 INFO - PROCESS | 12839 | 08:21:06 INFO - PROCESS | 12839 | __start_tp_report 08:21:06 INFO - PROCESS | 12839 | _x_x_mozilla_page_load 08:21:06 INFO - PROCESS | 12839 | _x_x_mozilla_page_load_details 08:21:06 INFO - PROCESS | 12839 | |i|pagename|runs| 08:21:06 INFO - PROCESS | 12839 | |0;dojo.html;3084.3214492811585;3148.5906832111823;3184.219866132798;3195.9840200798994;3227.5965504311953;5153.74231288435;5267.841964741064;5272.103742363798;5292.397223758488;5393.083175860108;5220.947790522103;5317.12267475866;5325.760340784665;5356.946430535693;5380.596455265852;4750.168720473912;4784.760761961906;4856.39295088114;4861.781219845116;5027.371578552681;4933.284673722308;4977.377827771528;4978.701277923318;4987.735486159318;4995.950040499603;4697;4784.808607655689;4852.102361063215;4873.512648735098;4931.235658472924;4846.806127754886;4859.82990595331;4868.634852386085;4875;4904.485029071931;4698;4729.196036673774;4736.242201247784;4738.360321356642;4772.832950846704;5108.974455127701;5122.052420302256;5186.611004174702;5246.685198888079;5251.133562962106;5678.176664383683;5688.544916406678;5706.80026199081;5709.885802283931;5715.3141623005085;5740.512056475204;5760.740766665468;5769.826905192851;5770.134479828017;5771.192033115367;5175.120229560984;5227.555657769056;5279.9208011879855;5298.470152984748;5305.495977882134;5786.1610066540115;5802.82591522255;5804.390538993429;5808.157817116495;5832.650040997553;5414.620976531605;5578.665280083208;5586.13414920688;5588.329400471969;5591.664500130005;5593.580481463907;5607.495325420732;5615.157726341082;5626.2685850839125;5657.830265092054;5582.525485333792;5593.468620481048;5600.887982240414;5603.271574695345;5620.185073164368;5484.890302193934;5616.241807356037;5620.690862002547;5622.887542249132;5631.6902570359025;4331.393604895317;4336.1978034063795;4341.6743744218675;4347.7173983690955;4373.518912919576;3876.127871228951;3894.883153505399;3906.140649057203;3911.5501717302873;3932.036651020518;5249.291345668286;5271.446498117719;5333.200019997032;5416.756245968941;5451.536619387317;5667.546596272288;5691.658500489983;5696.572757043155;5714.171445140514;5753.395893431213;5348.839534813962;5363.517283444508;5403.621746477709;5404.270423492857;5408.945910540844;4687.484376718558;4900.534449227318;4900.852974410774;4934.358533390708;4951.653384263067;5829.5336373090895;5836.153757705109;5836.358000619928;5842.386549412336;5852.326982396994;5610.27066481363;5613.607047506799;5613.719314034363;5614.831555053355;5615.6630602164005;5671.914921276267;5733.885322293614;5791;5808.39011903744;5812.505936995402;5605.80379686709;5619.241402410786;5620.381758006534;5620.4660557247;5622.297212848394;5667.1782591524825;5678.574106942078;5709.457601527848;5711.029125048834;5720.713964301685;5337.092694242066;5521;5538.196961440488;5575.693336866511;5592.189132575835;5394.78420863161;5406.945930540644;5407.567394608343;5408.783648654167;5411.567074634098;5331.360236771612;5353.2773075634295;5361.544268737045;5382.327209098863;5433.239346491573;5492.176173573996;5492.395836457907;5534.944650553443;5538.6122971391615;5566.415526369673;5400.135978243462;5433.375161856437;5434.75543600531;5439.864003399946;5453.945460545502 08:21:06 INFO - PROCESS | 12839 | |1;ext.html;604.6311749832602;648.649729146261;657.3623585122431;661.9040239165321;666.8799616069109;31217.687823121763;32189.51715724263;35556.11109722255;36571.817140914325;36737.26525469489;38573.42139867904;39463.60536394635;39506;39519.40720889189;39622.207555848865;8446.999999999985;8643.481391116553;8685.044645089036;8685.782855428602;8695.521746303952;7707.190744971781;9733.415995040285;9982.201423886072;10001.49992500372;10001.49992500372;10080.899191008106;10240.743981400487;10261.692149235534;10285;10290.948545257263;9995.050470205319;10026.498675066217;10066.14437772783;10082.747931301703;10094.141997930148;9933.70198894027;10060.647877324258;10088.445135517544;10093.899061009442;10094.091531762104;40472;40631.593684063075;40649.593504065175;40765;40839.18321633551;3344.9832750836335;3375.932481350384;3396.7961922284494;3969.6625786808154;4292.7209731367675;31007.689923100705;31454;31535.842320788248;32650.510242346383;32760.344793104243;4197.353065329141;4274.137785228565;4281.785910704452;4314.395984562164;4339.153864996327;336940;338191.99999999756;338607;338911;339739;59778;59974.10038849421;60412;60452.39547604468;60515.69742151261;53837.73081134569;55725.72137139289;55797.721011394686;55938.440615593325;62448;16853.410130645614;16919.83080169207;17014.744778828328;17056.147192640317;17072.2317495713;10105.949470252748;12386.071044671506;12388.56640017595;12403.25580465175;12742.68143296425;18415.53961150955;18416;18497.630047399245;18617;18641.906790466233;7029.753958611424;7260.310270524292;7270;7316.341829085457;7370.078740157481;1090.5528733219342;1094.1848322999417;1188.316717887201;1228.7358217983176;1255.9309237991815;31622.683773161974;32473.51289730656;32693.67306326954;32698.509522357184;32946;1071.276888100529;1073.6456969200144;1076.2950267574752;1149.3276433286453;1166.4109624639673;16732.813147424244;17049.31802727902;17088.57278568046;17283.74074388885;17690.203940822696;498188;503724;504183;507181;508650;57053.42946570481;57473;57566.42433575694;57598;57731.4226857726;1348.8651134886434;1349.4669605505967;1370.2121280263689;1382.654336415896;1493.9327730252164;27546.5868011984;30293.848530757205;30545.54181687321;31223.843880780452;31262.687373125977;44375.11249775051;44451.11097778091;44771.77614111909;44821.775891120335;44843.55156448524;272215;272936;273741;274003;275093;22853.771462285164;24767.50464990726;25496.490070198863;25510.489790204465;25531.617025745;39331.6066839328;39528.209435811696;39680;40551;40565;37817;38499.80750096231;38517.807410963884;39025.41461878131;39375.40936885892;37150.6284937158;38251.617483824804;38283.2343353137;38449.80775096107;38606.2278754429;38481.23037539289;38853.611463885;38956.2208755829;39718.404223936086;39940;31099.440575408942;31214.21964450907;31795.84102079475;31890.36219275555;32912.506312404854;26745.197644070708;27195;27457.588136177576;27486.725132748415;27573.172804815888 08:21:06 INFO - PROCESS | 12839 | |2;jquery.html;390.170886865411;393.57493906580885;393.80113042913325;409.96310332070107;412.7234752715682;14160.501530142305;16444.588885277873;18104.185311660975;18616.348427805013;18711.532211694714;14210.92894535526;17653.911730441363;17819.64360712788;17899.28402863887;17983.100844957764;5489.533389661873;5530.861728456781;5580.944190558083;5582.330120385539;5662.094064949609;4064.2887494688457;5434.565234781227;5592.720363981805;5620.606557540974;5952.107183922403;6178.567500274982;6185.257769067718;6191.257049154108;6194.907076393858;6197.0704394340755;6111.572189946705;6124.540659450559;6156.015037593986;6335.11308416822;6346.365363463663;5485.670859748428;5486.3690675572425;5566.944330556683;5589.0219211638205;5602.915956260659;21197.576048478943;21576.24483143098;22492.43768905774;22559.210427635117;22636.434089147737;2241.2939923923914;2276.4764104256114;2302.1712183613886;2461.938451538708;2675.8761320245544;13357.465701371933;13625.454981800814;13809.033367664268;13914.791278130837;14049.71900561983;1854.944351669452;1909.102721720803;1931.0730849192325;1981.8612697111207;1989.4827344890289;72126.27873721249;79582.20417795806;80192.59903700503;80499;81246.59376703079;10781.407022613832;10877.129829613612;10949.069329107115;10976.835347469794;11364.261323014143;15133;15180.620484487756;15227.162506062052;15252.237388130548;15280.388784448498;6833.145856767904;7595.734149304748;8202.753917382488;8368.665253389918;8481.787955301166;7478.551286922802;7592.582407967504;7595.5822429765785;7703.8844417333785;7749.883751743729;4665.813367465331;4679.883002924954;4706.88232794176;4798.688085274516;4808.543188397097;1872.5768416003664;1897.8576606754273;1898.8385987190968;1907.7806052303886;1949.5321122930395;872.9869051964225;1009.4902074452501;1024.8206563851297;1066.1950227578284;1077.6874706335232;17495.475135745946;17586.560335991446;18041.54896127581;18352.908235459003;18571.813473570754;962.4081190068058;977.9217662586976;1002.0580654185043;1018.765683892694;1021.3310281765456;10311.84532232017;10767.19246056549;10781.9460902695;10819.13446924244;10822.891771082346;475999;477013;483083;484642;484911;84305.52014119063;84393;87064.56467717748;95802.52098739462;97345.51327243318;1042.5673345561659;1101.372217835826;1103.0403548912498;1104.6575561575937;1157.056998546182;15606.531804045897;16229.350825966829;16287.918560407123;16432.424865129662;16558.58603534873;36935.63064369322;37330.81334593309;37540.3074615673;37549.81225093966;38172.618273818014;41917;44011.77994110009;46201.07597848091;47844.76077619729;48949.75525122351;7707.306342429209;7785.688572457038;7787.961060194662;8137.959310203411;8208.343332533503;8755.387122901337;12247.203931744409;12600.810987835373;12773.361331933553;13000.154989925624;11398.373089479826;11453.370064646524;11516.827247591125;11660.650180494598;11846.289222646668;10728;11012.779744404907;11024.228304018963;11244.493997770283;11517.366544840113;11110.555577776799;11681.649550513499;11709.648710538697;11982.700432489257;12248.632541023784;7878.487898286593;8373.539455330016;8459.196376344238;8605.268552172885;8991.235744961752;11249.606263780728;11266.887331126913;11358.716032099264;11548.422578870855;11625.59310424131 08:21:06 INFO - PROCESS | 12839 | |3;mootools.html;1239.96900077498;1412.7527682655536;1453.8836893048558;1571.8035245594301;1752.719564869621;7347.228541003191;7630.351420129296;7644.770656880296;7657;7669.34810541104;7333;7515.248475152482;7521.210272921333;7522.736704215354;7525.811854703635;1889.811018898113;2217.301550011749;2218.667199920013;2262.6379779235326;2295.908163673451;2251.234580242717;2251.752307246202;2255.1430456426615;2262.8302877284186;2264.626336654458;2235.932922012334;2237.876916769585;2275.6358982562792;2280.600894843404;2283.577538155438;1928.951776205592;1980.9306674266331;1986.0764744393925;2127.8723276603378;2148.785121487854;2209.712737344135;2238.5746708125566;2243.069126312578;2248.415411992877;2252.031626400647;7483.8877416838795;7554.433417493655;7558.244175582453;7617.733379331697;7683.654235559413;4591.701539399928;4682.765861706901;4692.929606055912;4729.432468103815;4729.456112547066;2950.2181921790743;2999.1302522268516;3133.4673105572106;3137.4823154179535;3163.3673265347024;980.1717548671361;991.9652812151612;1032.7727899862018;1038.5793753529833;1050.74256807082;10446;10954.671359859218;10958.616448424267;10961.342319460779;10965.50655220509;4242.936355954663;4298.677599180074;4320.675949303814;4348.412964249849;4464.508904020555;9387.718368448957;9522.285828562886;9527.142557169887;9531.285153613506;9535.094166054214;4938.259261110862;4942.110420124341;4980.526849949249;4986.077575648516;4988.052270068675;4025.355943049098;4362.367456718758;4488.730676159441;4505.842295519707;4515.887102822456;3780.8865734028022;3784.262068896539;3869.2068126034096;3876.96123038766;3930.449737036817;1250.412306216077;1267.309316422552;1269.0989397527674;1287.5300515311844;1298.2729671384054;915.8706008530194;920.4431319052011;942.6276620734908;967.3953778888194;977.5454413697664;5343.198520221998;5365.382980957162;5610.214569960209;5619.522340601013;5779.913301300484;409.38183343152053;411.1448187769432;430.0731922706572;436.45225242321317;439.04945792359183;3769.8869033928477;3776.244751049746;3987.9631295863283;3991.401289806552;4012.117334186474;9495.952520237355;9832.01679832011;10038.196944244442;10043.045910638477;10088.49557522121;9730.270229732798;9826.410415374958;9842.901570984342;9958.352707074017;9975.301728879054;7192.208857025723;7342.302481264272;7422.48042637021;7436.3679087277105;7448.925510744932;5427.050266203478;5486.369067557282;5564.749586268546;5646.576506761927;5658.151277308437;8604.913950860411;8735.257503112307;8814.338924580554;8947.463152210888;8995.730128096167;8980.775480613036;9053.275737940818;9103.49930753815;9260.39807412516;9261.814763704553;6223.813285601439;6917;6933.687984040831;6977.406920411822;7110.537815042006;7751.224877512203;7760.107587627269;7778.105517865518;7787;7823.374130069467;6603.240627327918;6772.390484856386;6784.559003664944;6939.30606939302;6948.374646281859;6898.620575868375;6945.652717364011;6953.965230173817;6955.304469553004;7061.6469176542;6270.9372906270355;6282.120503129474;6340.556161068866;6399.6800159992745;6410.070539771614;4717.811287548459;4948.084604348207;4958.1323268428605;4969.130402179532;5040.571551418024;4816.253480710496;4853.635977301646;4875.68308059975;4880.511948805091;4892.315075889307 08:21:06 INFO - PROCESS | 12839 | |4;prototype.html;302.9257831831203;312.5561702382617;314.16588956320965;314.71203848478643;318.68927795399475;5074.898502029957;5180.792768289273;5233.188855727359;5340.279062326589;5375.731213439327;5255.500727430897;5274.314339135916;5278.8122672398695;5321.654092483986;5327;4171.979140104295;4172.311568591179;4173.3739939009165;4183.6653067754505;4188.81150348235;3903.9804800975953;3906.9255954612568;4032.5160980682213;4101.856435024774;4209.34755112958;4107.815148318333;4125.2780763366445;4150.605692459211;4150.854720084798;4154.709170358076;4127.545969943304;4129.752214867088;4143.150654115899;4145.97927010363;4155;3427.160345715291;3666.138457462494;3667.8166091695575;3679.632036796326;3685.9078523037138;5063;5084.415292241402;5101.51535604117;5105.157648987913;5106.923396149061;4658.953410465886;4662.557057079572;4668.696534725232;4677.74272415017;4693.741844198567;5383.43473935239;5412.377576578665;5502.944970550283;5555.611107222496;5563.248961390201;3890.4942357493346;3896.045468860119;3928.155446578999;3937.448757173998;3958.6437220650278;5671.574631902624;5717.371089180187;5757.453041961007;5763.308402991668;5809.796657117023;3868.458415821787;3878.6121387861554;3880.0299925018744;3883.2427676602792;3892.4355968384425;3801.144742432986;4022.8390864365097;4028.4762980812893;4028.939565906514;4045.9190816183514;4576.290674945389;4617.7691115444095;4624.3294722265755;4630.490646028934;4653.139169253699;5268.683878967274;5496.285482887279;5520.309961254843;5547.667139971614;5549.833504994856;1381.9221007614078;1409.9154050756988;1410.675544624742;1412.498563010137;1475.2697414779539;962.8026254617787;982.3467394182788;983.7589790501373;989.8960609136082;990.2622546203124;5661.971690141523;5682.943170568324;5687.345955215121;5687.578105473632;5703.800366987136;5525.502704756591;5802.390748971382;5803.419658034163;6017.849553761191;6060.121282414026;5385.515303622693;5429;5447.6459030163705;5451.972740136274;5463.262459567987;3104.534319851995;3216.260260140181;3236.821974791362;3237.1583388319204;3245.3996010738088;6238.719257633417;6324.525660575383;6378.681065946684;6386;6389.201349831271;6249;6254.655993920287;6259.217597800275;6285.622862628165;6291.433770960544;5705.2012718219485;5937.851553711105;5966.791162309211;5975.713357653361;6309.305976342599;5690.743916523684;5733.913991290217;5735.56983226268;5739.454751798739;5739.8565035874435;5551.390846302232;5683.914741278802;5686.203931449518;5690.829275121753;5709.286339207599;5909.852253693692;5930.466258036798;5940.851478713067;5949.494292985145;5951.970240148771;3982.8008599569325;3992.7604343739467;4006.7395619284653;4042.676585873182;4044.1911617675996;5286.97356513215;5393.244945707683;5528.834134975958;5797.652140871562;5798.739056742373;5562.833115006556;5563.165525171256;5600.131979543177;5617.820257745919;5631.662100273997;5569.860753481195;5581.018738347828;5581.302337207849;5582.413846546055;5592.105263157875;5270.657407268515;5541.695206763506;5566.109422492382;5570.192322113352;5571.804986825442;5544.417836127149;5609.214709940693;5617.382087970238;5682.7782026864425;5685.687287199244;5165.690058596496;5531.751071201886;5547.33431988164;5555.916661250004;5572.637778544544 08:21:06 INFO - PROCESS | 12839 | |5;yui.html;687.1445050911616;754.2495217258827;769.1001528211991;770.556929765385;772.204629231891;12082.758344833099;12340.13619046667;12400;12410.751784964295;12439.751204975895;10751.462426878645;10789.784204315909;10793.676189714302;10799.460026998659;10804;668.5620918298522;781.0900301149154;811.4036183405193;813.6216659253446;814.2915663372873;799.8520273749346;801.8676918308472;803.9397045221602;804.388664614894;804.4690504267185;697.4524997876667;831.8793774902636;834.9123342049088;837.4682076881163;839.0099682374795;713.247523862325;719.2627556754317;810.5015415519442;843.6119385082808;848.9363297752632;623.8502759337727;625.5871125057486;625.8122563231058;626.1890851347516;626.5958456795387;12014.219075760047;12033.51865925362;12047.156699030984;12064.577739779066;12070.456829442695;10658.307210031324;10881.564737410494;11259.042981346514;11420.771584568345;11524.884751152465;9521.714348569554;9633.518324083769;9671.854922176173;9720.368176068532;9749.707508774749;3588.7661196652293;3605.4591811228265;3618.1678214010662;3678.6137455567314;3686.64976827201;49660;50481.24278135794;50493.24260136101;50729.98540029216;50771;9352.625894964125;9437.150656440954;9569.808603827885;9611.615535378507;9630.374025688308;17422.303107875545;17520.561985950455;17535.210915508833;17590.296388144332;17596.38412655551;7456.7390141344795;7526.209747976383;7545.434092443089;7641.312281894656;7971.521708697497;4163.958360416357;4208.053188032668;4213.199492096492;4317.611414972667;4376.518582955872;2919.8978035768646;2967.747741442002;2967.9554806677484;2973.8810447582287;2976.151796737919;517.4799326676741;538.6498775795686;554.0746952589186;557.128094532056;557.2449331156306;543;574.3452464190826;602.6233603997501;656.7405874679475;657.7862194786713;7618.686440255127;7970.163132871081;8001.279884810278;8018.5990700464745;8117.675292988214;634.9714262858182;640.5356116815271;647.2233320015905;651.9641419721961;654.7479220500142;4071.267171909085;4178.979105104455;4262.190183865117;4308.009157893702;4446.710963787344;64101.67949160318;70708.2929170712;73135.63432182911;73658;73727.26272737312;48387.51612483901;49877;49968.50031499711;50471.71933824363;60432.69783651054;50442.74778626157;50621.746891265306;50673.74663126661;50756.74621626942;50943;8413.284870786052;8491.405601607828;8616.956915215384;8662.81364110909;8670.653173872974;31754.52368214525;32406.351872961935;32460;33397.16507087245;33716.83141584276;43753;44474.55525444704;45139;45890.541094588625;46603.30095048509;10231.386116833013;10294.330868493524;10725.30285531438;10807;10994.615188468366;11485.540578377106;11674.70813229676;11891.643250702493;12164.635060948185;12370.81443778362;10626.89373106259;10777.51501182433;10880.891191088305;10986.450677466255;11177.944110279397;10881.564737410416;10892.292001019909;11183.217174797686;11308.321500709984;11403.201775875941;11092.833607496055;11243.831342530033;11390.829137563109;11424.48589813477;11527.654170374903;8741.34439916996;8772.385932984886;9057.320700947586;9093.363464557417;9193.816123677356;9885.357451765612;10033.598656053968;10071.748206294902;10079.34484258521;10106.140978016656 08:21:06 INFO - PROCESS | 12839 | __end_tp_report 08:21:06 INFO - PROCESS | 12839 | __start_cc_report 08:21:06 INFO - PROCESS | 12839 | _x_x_mozilla_cycle_collect,766 08:21:06 INFO - PROCESS | 12839 | __end_cc_report 08:21:06 INFO - PROCESS | 12839 | __startTimestamp1461856866902__endTimestamp 08:21:06 INFO - PROCESS | 12839 | 08:21:06 INFO - PROCESS | 12839 | ------- Summary: start ------- 08:21:06 INFO - PROCESS | 12839 | Number of tests: 6 08:21:06 INFO - PROCESS | 12839 | 08:21:06 INFO - PROCESS | 12839 | [#0] dojo.html Cycles:165 Average:5255.92 Median:5408.95 stddev:573.28 (10.6%) stddev-sans-first:549.15 08:21:06 INFO - PROCESS | 12839 | Values: 3084.3 3148.6 3184.2 3196.0 3227.6 5153.7 5267.8 5272.1 5292.4 5393.1 5220.9 5317.1 5325.8 5356.9 5380.6 4750.2 4784.8 4856.4 4861.8 5027.4 4933.3 4977.4 4978.7 4987.7 4996.0 4697.0 4784.8 4852.1 4873.5 4931.2 4846.8 4859.8 4868.6 4875.0 4904.5 4698.0 4729.2 4736.2 4738.4 4772.8 5109.0 5122.1 5186.6 5246.7 5251.1 5678.2 5688.5 5706.8 5709.9 5715.3 5740.5 5760.7 5769.8 5770.1 5771.2 5175.1 5227.6 5279.9 5298.5 5305.5 5786.2 5802.8 5804.4 5808.2 5832.7 5414.6 5578.7 5586.1 5588.3 5591.7 5593.6 5607.5 5615.2 5626.3 5657.8 5582.5 5593.5 5600.9 5603.3 5620.2 5484.9 5616.2 5620.7 5622.9 5631.7 4331.4 4336.2 4341.7 4347.7 4373.5 3876.1 3894.9 3906.1 3911.6 3932.0 5249.3 5271.4 5333.2 5416.8 5451.5 5667.5 5691.7 5696.6 5714.2 5753.4 5348.8 5363.5 5403.6 5404.3 5408.9 4687.5 4900.5 4900.9 4934.4 4951.7 5829.5 5836.2 5836.4 5842.4 5852.3 5610.3 5613.6 5613.7 5614.8 5615.7 5671.9 5733.9 5791.0 5808.4 5812.5 5605.8 5619.2 5620.4 5620.5 5622.3 5667.2 5678.6 5709.5 5711.0 5720.7 5337.1 5521.0 5538.2 5575.7 5592.2 5394.8 5406.9 5407.6 5408.8 5411.6 5331.4 5353.3 5361.5 5382.3 5433.2 5492.2 5492.4 5534.9 5538.6 5566.4 5400.1 5433.4 5434.8 5439.9 5453.9 08:21:06 INFO - PROCESS | 12839 | 08:21:06 INFO - PROCESS | 12839 | [#1] ext.html Cycles:180 Average:53251.53 Median:338399.50 stddev:101851.07 (30.1%) stddev-sans-first:102060.09 08:21:06 INFO - PROCESS | 12839 | Values: 604.6 648.6 657.4 661.9 666.9 31217.7 32189.5 35556.1 36571.8 36737.3 38573.4 39463.6 39506.0 39519.4 39622.2 8447.0 8643.5 8685.0 8685.8 8695.5 7707.2 9733.4 9982.2 10001.5 10001.5 10080.9 10240.7 10261.7 10285.0 10290.9 9995.1 10026.5 10066.1 10082.7 10094.1 9933.7 10060.6 10088.4 10093.9 10094.1 40472.0 40631.6 40649.6 40765.0 40839.2 3345.0 3375.9 3396.8 3969.7 4292.7 31007.7 31454.0 31535.8 32650.5 32760.3 4197.4 4274.1 4281.8 4314.4 4339.2 336940.0 338192.0 338607.0 338911.0 339739.0 59778.0 59974.1 60412.0 60452.4 60515.7 53837.7 55725.7 55797.7 55938.4 62448.0 16853.4 16919.8 17014.7 17056.1 17072.2 10105.9 12386.1 12388.6 12403.3 12742.7 18415.5 18416.0 18497.6 18617.0 18641.9 7029.8 7260.3 7270.0 7316.3 7370.1 1090.6 1094.2 1188.3 1228.7 1255.9 31622.7 32473.5 32693.7 32698.5 32946.0 1071.3 1073.6 1076.3 1149.3 1166.4 16732.8 17049.3 17088.6 17283.7 17690.2 498188.0 503724.0 504183.0 507181.0 508650.0 57053.4 57473.0 57566.4 57598.0 57731.4 1348.9 1349.5 1370.2 1382.7 1493.9 27546.6 30293.8 30545.5 31223.8 31262.7 44375.1 44451.1 44771.8 44821.8 44843.6 272215.0 272936.0 273741.0 274003.0 275093.0 22853.8 24767.5 25496.5 25510.5 25531.6 39331.6 39528.2 39680.0 40551.0 40565.0 37817.0 38499.8 38517.8 39025.4 39375.4 37150.6 38251.6 38283.2 38449.8 38606.2 38481.2 38853.6 38956.2 39718.4 39940.0 31099.4 31214.2 31795.8 31890.4 32912.5 26745.2 27195.0 27457.6 27486.7 27573.2 08:21:06 INFO - PROCESS | 12839 | 08:21:06 INFO - PROCESS | 12839 | [#2] jquery.html Cycles:180 Average:27977.13 Median:22597.82 stddev:79205.54 (350.5%) stddev-sans-first:79400.65 08:21:06 INFO - PROCESS | 12839 | Values: 390.2 393.6 393.8 410.0 412.7 14160.5 16444.6 18104.2 18616.3 18711.5 14210.9 17653.9 17819.6 17899.3 17983.1 5489.5 5530.9 5580.9 5582.3 5662.1 4064.3 5434.6 5592.7 5620.6 5952.1 6178.6 6185.3 6191.3 6194.9 6197.1 6111.6 6124.5 6156.0 6335.1 6346.4 5485.7 5486.4 5566.9 5589.0 5602.9 21197.6 21576.2 22492.4 22559.2 22636.4 2241.3 2276.5 2302.2 2461.9 2675.9 13357.5 13625.5 13809.0 13914.8 14049.7 1854.9 1909.1 1931.1 1981.9 1989.5 72126.3 79582.2 80192.6 80499.0 81246.6 10781.4 10877.1 10949.1 10976.8 11364.3 15133.0 15180.6 15227.2 15252.2 15280.4 6833.1 7595.7 8202.8 8368.7 8481.8 7478.6 7592.6 7595.6 7703.9 7749.9 4665.8 4679.9 4706.9 4798.7 4808.5 1872.6 1897.9 1898.8 1907.8 1949.5 873.0 1009.5 1024.8 1066.2 1077.7 17495.5 17586.6 18041.5 18352.9 18571.8 962.4 977.9 1002.1 1018.8 1021.3 10311.8 10767.2 10781.9 10819.1 10822.9 475999.0 477013.0 483083.0 484642.0 484911.0 84305.5 84393.0 87064.6 95802.5 97345.5 1042.6 1101.4 1103.0 1104.7 1157.1 15606.5 16229.4 16287.9 16432.4 16558.6 36935.6 37330.8 37540.3 37549.8 38172.6 41917.0 44011.8 46201.1 47844.8 48949.8 7707.3 7785.7 7788.0 8138.0 8208.3 8755.4 12247.2 12600.8 12773.4 13000.2 11398.4 11453.4 11516.8 11660.7 11846.3 10728.0 11012.8 11024.2 11244.5 11517.4 11110.6 11681.6 11709.6 11982.7 12248.6 7878.5 8373.5 8459.2 8605.3 8991.2 11249.6 11266.9 11358.7 11548.4 11625.6 08:21:06 INFO - PROCESS | 12839 | 08:21:06 INFO - PROCESS | 12839 | [#3] mootools.html Cycles:180 Average:5250.89 Median:4963.63 stddev:2913.53 (58.7%) stddev-sans-first:2906.11 08:21:06 INFO - PROCESS | 12839 | Values: 1240.0 1412.8 1453.9 1571.8 1752.7 7347.2 7630.4 7644.8 7657.0 7669.3 7333.0 7515.2 7521.2 7522.7 7525.8 1889.8 2217.3 2218.7 2262.6 2295.9 2251.2 2251.8 2255.1 2262.8 2264.6 2235.9 2237.9 2275.6 2280.6 2283.6 1929.0 1980.9 1986.1 2127.9 2148.8 2209.7 2238.6 2243.1 2248.4 2252.0 7483.9 7554.4 7558.2 7617.7 7683.7 4591.7 4682.8 4692.9 4729.4 4729.5 2950.2 2999.1 3133.5 3137.5 3163.4 980.2 992.0 1032.8 1038.6 1050.7 10446.0 10954.7 10958.6 10961.3 10965.5 4242.9 4298.7 4320.7 4348.4 4464.5 9387.7 9522.3 9527.1 9531.3 9535.1 4938.3 4942.1 4980.5 4986.1 4988.1 4025.4 4362.4 4488.7 4505.8 4515.9 3780.9 3784.3 3869.2 3877.0 3930.4 1250.4 1267.3 1269.1 1287.5 1298.3 915.9 920.4 942.6 967.4 977.5 5343.2 5365.4 5610.2 5619.5 5779.9 409.4 411.1 430.1 436.5 439.0 3769.9 3776.2 3988.0 3991.4 4012.1 9496.0 9832.0 10038.2 10043.0 10088.5 9730.3 9826.4 9842.9 9958.4 9975.3 7192.2 7342.3 7422.5 7436.4 7448.9 5427.1 5486.4 5564.7 5646.6 5658.2 8604.9 8735.3 8814.3 8947.5 8995.7 8980.8 9053.3 9103.5 9260.4 9261.8 6223.8 6917.0 6933.7 6977.4 7110.5 7751.2 7760.1 7778.1 7787.0 7823.4 6603.2 6772.4 6784.6 6939.3 6948.4 6898.6 6945.7 6954.0 6955.3 7061.6 6270.9 6282.1 6340.6 6399.7 6410.1 4717.8 4948.1 4958.1 4969.1 5040.6 4816.3 4853.6 4875.7 4880.5 4892.3 08:21:06 INFO - PROCESS | 12839 | 08:21:06 INFO - PROCESS | 12839 | [#4] prototype.html Cycles:180 Average:4713.38 Median:5389.38 stddev:1415.46 (26.3%) stddev-sans-first:1380.18 08:21:06 INFO - PROCESS | 12839 | Values: 302.9 312.6 314.2 314.7 318.7 5074.9 5180.8 5233.2 5340.3 5375.7 5255.5 5274.3 5278.8 5321.7 5327.0 4172.0 4172.3 4173.4 4183.7 4188.8 3904.0 3906.9 4032.5 4101.9 4209.3 4107.8 4125.3 4150.6 4150.9 4154.7 4127.5 4129.8 4143.2 4146.0 4155.0 3427.2 3666.1 3667.8 3679.6 3685.9 5063.0 5084.4 5101.5 5105.2 5106.9 4659.0 4662.6 4668.7 4677.7 4693.7 5383.4 5412.4 5502.9 5555.6 5563.2 3890.5 3896.0 3928.2 3937.4 3958.6 5671.6 5717.4 5757.5 5763.3 5809.8 3868.5 3878.6 3880.0 3883.2 3892.4 3801.1 4022.8 4028.5 4028.9 4045.9 4576.3 4617.8 4624.3 4630.5 4653.1 5268.7 5496.3 5520.3 5547.7 5549.8 1381.9 1409.9 1410.7 1412.5 1475.3 962.8 982.3 983.8 989.9 990.3 5662.0 5682.9 5687.3 5687.6 5703.8 5525.5 5802.4 5803.4 6017.8 6060.1 5385.5 5429.0 5447.6 5452.0 5463.3 3104.5 3216.3 3236.8 3237.2 3245.4 6238.7 6324.5 6378.7 6386.0 6389.2 6249.0 6254.7 6259.2 6285.6 6291.4 5705.2 5937.9 5966.8 5975.7 6309.3 5690.7 5733.9 5735.6 5739.5 5739.9 5551.4 5683.9 5686.2 5690.8 5709.3 5909.9 5930.5 5940.9 5949.5 5952.0 3982.8 3992.8 4006.7 4042.7 4044.2 5287.0 5393.2 5528.8 5797.7 5798.7 5562.8 5563.2 5600.1 5617.8 5631.7 5569.9 5581.0 5581.3 5582.4 5592.1 5270.7 5541.7 5566.1 5570.2 5571.8 5544.4 5609.2 5617.4 5682.8 5685.7 5165.7 5531.8 5547.3 5555.9 5572.6 08:21:06 INFO - PROCESS | 12839 | 08:21:06 INFO - PROCESS | 12839 | [#5] yui.html Cycles:180 Average:14040.34 Median:50487.24 stddev:17523.38 (34.7%) stddev-sans-first:17543.85 08:21:06 INFO - PROCESS | 12839 | Values: 687.1 754.2 769.1 770.6 772.2 12082.8 12340.1 12400.0 12410.8 12439.8 10751.5 10789.8 10793.7 10799.5 10804.0 668.6 781.1 811.4 813.6 814.3 799.9 801.9 803.9 804.4 804.5 697.5 831.9 834.9 837.5 839.0 713.2 719.3 810.5 843.6 848.9 623.9 625.6 625.8 626.2 626.6 12014.2 12033.5 12047.2 12064.6 12070.5 10658.3 10881.6 11259.0 11420.8 11524.9 9521.7 9633.5 9671.9 9720.4 9749.7 3588.8 3605.5 3618.2 3678.6 3686.6 49660.0 50481.2 50493.2 50730.0 50771.0 9352.6 9437.2 9569.8 9611.6 9630.4 17422.3 17520.6 17535.2 17590.3 17596.4 7456.7 7526.2 7545.4 7641.3 7971.5 4164.0 4208.1 4213.2 4317.6 4376.5 2919.9 2967.7 2968.0 2973.9 2976.2 517.5 538.6 554.1 557.1 557.2 543.0 574.3 602.6 656.7 657.8 7618.7 7970.2 8001.3 8018.6 8117.7 635.0 640.5 647.2 652.0 654.7 4071.3 4179.0 4262.2 4308.0 4446.7 64101.7 70708.3 73135.6 73658.0 73727.3 48387.5 49877.0 49968.5 50471.7 60432.7 50442.7 50621.7 50673.7 50756.7 50943.0 8413.3 8491.4 8617.0 8662.8 8670.7 31754.5 32406.4 32460.0 33397.2 33716.8 43753.0 44474.6 45139.0 45890.5 46603.3 10231.4 10294.3 10725.3 10807.0 10994.6 11485.5 11674.7 11891.6 12164.6 12370.8 10626.9 10777.5 10880.9 10986.5 11177.9 10881.6 10892.3 11183.2 11308.3 11403.2 11092.8 11243.8 11390.8 11424.5 11527.7 8741.3 8772.4 9057.3 9093.4 9193.8 9885.4 10033.6 10071.7 10079.3 10106.1 08:21:06 INFO - PROCESS | 12839 | -------- Summary: end -------- 08:21:06 INFO - PROCESS | 12839 | 08:21:07 INFO - TEST-INFO | 12839: exit 0 08:21:07 INFO - TEST-OK | dromaeo_css | took 1111851ms 08:21:07 INFO - TEST-START | kraken 08:21:07 INFO - operating with platform_type : linux_ 08:21:07 INFO - Initialising browser for kraken test... 08:21:07 INFO - TEST-INFO | started process 13022 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCJkRuo/profile http://localhost:39164/getInfo.html) 08:21:11 INFO - PROCESS | 13022 | __metrics Screen width/height:1600/1200 08:21:11 INFO - PROCESS | 13022 | colorDepth:24 08:21:11 INFO - PROCESS | 13022 | Browser inner width/height: 1024/697 08:21:11 INFO - PROCESS | 13022 | __metrics 08:21:12 ERROR - PROCESS | 13022 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 08:21:13 INFO - TEST-INFO | 13022: exit 0 08:21:13 INFO - Browser initialized. 08:21:13 INFO - Running cycle 1/1 for kraken test... 08:21:13 INFO - TEST-INFO | started process 13104 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCJkRuo/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:21:25 INFO - PROCESS | 13104 | RSS: Main: 155029504 08:21:25 INFO - PROCESS | 13104 | 08:21:27 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39164/tests/kraken/driver.html?testName=audio-beat-detection) 08:21:28 INFO - PROCESS | 13104 | RSS: Main: 210411520 08:21:28 INFO - PROCESS | 13104 | 08:21:31 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39164/tests/kraken/driver.html?testName=audio-dft) 08:21:31 INFO - PROCESS | 13104 | RSS: Main: 195510272 08:21:31 INFO - PROCESS | 13104 | 08:21:34 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39164/tests/kraken/driver.html?testName=audio-fft) 08:21:35 INFO - PROCESS | 13104 | RSS: Main: 266137600 08:21:35 INFO - PROCESS | 13104 | 08:21:37 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39164/tests/kraken/driver.html?testName=audio-oscillator) 08:21:38 INFO - PROCESS | 13104 | RSS: Main: 174329856 08:21:38 INFO - PROCESS | 13104 | 08:21:40 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39164/tests/kraken/driver.html?testName=imaging-gaussian-blur) 08:21:41 INFO - PROCESS | 13104 | RSS: Main: 179580928 08:21:41 INFO - PROCESS | 13104 | 08:21:44 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39164/tests/kraken/driver.html?testName=imaging-darkroom) 08:21:44 INFO - PROCESS | 13104 | RSS: Main: 215068672 08:21:44 INFO - PROCESS | 13104 | 08:21:47 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39164/tests/kraken/driver.html?testName=imaging-desaturate) 08:21:48 INFO - PROCESS | 13104 | RSS: Main: 215818240 08:21:48 INFO - PROCESS | 13104 | 08:21:51 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39164/tests/kraken/driver.html?testName=json-parse-financial) 08:21:51 INFO - PROCESS | 13104 | RSS: Main: 215683072 08:21:51 INFO - PROCESS | 13104 | 08:21:53 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39164/tests/kraken/driver.html?testName=json-stringify-tinderbox) 08:21:54 INFO - PROCESS | 13104 | RSS: Main: 201605120 08:21:54 INFO - PROCESS | 13104 | 08:21:55 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39164/tests/kraken/driver.html?testName=stanford-crypto-aes) 08:21:56 INFO - PROCESS | 13104 | RSS: Main: 203911168 08:21:56 INFO - PROCESS | 13104 | 08:21:58 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39164/tests/kraken/driver.html?testName=stanford-crypto-ccm) 08:21:59 INFO - PROCESS | 13104 | RSS: Main: 216358912 08:21:59 INFO - PROCESS | 13104 | 08:22:01 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39164/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 08:22:02 INFO - PROCESS | 13104 | RSS: Main: 222842880 08:22:02 INFO - PROCESS | 13104 | 08:22:05 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39164/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 08:22:05 INFO - PROCESS | 13104 | RSS: Main: 218546176 08:22:05 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | Cycle 1(1): loaded http://localhost:39164/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39164/tests/kraken/driver.html?testName=ai-astar) 08:22:07 INFO - PROCESS | 13104 | RSS: Main: 281915392 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | __start_tp_report 08:22:07 INFO - PROCESS | 13104 | _x_x_mozilla_page_load 08:22:07 INFO - PROCESS | 13104 | _x_x_mozilla_page_load_details 08:22:07 INFO - PROCESS | 13104 | |i|pagename|runs| 08:22:07 INFO - PROCESS | 13104 | |0;ai-astar;111;112;107;110;114;112;102;112;112;112 08:22:07 INFO - PROCESS | 13104 | |1;audio-beat-detection;165;124;154;182;130;155;167;130;186;137 08:22:07 INFO - PROCESS | 13104 | |2;audio-dft;162;160;160;159;160;162;163;161;162;161 08:22:07 INFO - PROCESS | 13104 | |3;audio-fft;75;74;113;108;74;74;72;126;117;76 08:22:07 INFO - PROCESS | 13104 | |4;audio-oscillator;94;93;149;93;94;93;140;93;92;143 08:22:07 INFO - PROCESS | 13104 | |5;imaging-gaussian-blur;117;117;117;117;117;117;118;116;116;117 08:22:07 INFO - PROCESS | 13104 | |6;imaging-darkroom;146;144;146;146;145;145;145;145;145;145 08:22:07 INFO - PROCESS | 13104 | |7;imaging-desaturate;94;95;95;95;95;95;95;95;95;95 08:22:07 INFO - PROCESS | 13104 | |8;json-parse-financial;57;57;57;56;56;57;57;71;54;55 08:22:07 INFO - PROCESS | 13104 | |9;json-stringify-tinderbox;60;61;61;61;62;61;62;62;62;62 08:22:07 INFO - PROCESS | 13104 | |10;stanford-crypto-aes;79;77;76;76;78;86;78;80;78;76 08:22:07 INFO - PROCESS | 13104 | |11;stanford-crypto-ccm;124;127;123;123;121;122;126;129;156;124 08:22:07 INFO - PROCESS | 13104 | |12;stanford-crypto-pbkdf2;167;170;171;176;170;169;172;168;167;168 08:22:07 INFO - PROCESS | 13104 | |13;stanford-crypto-sha256-iterative;71;70;70;70;70;72;69;69;68;67 08:22:07 INFO - PROCESS | 13104 | __end_tp_report 08:22:07 INFO - PROCESS | 13104 | __start_cc_report 08:22:07 INFO - PROCESS | 13104 | _x_x_mozilla_cycle_collect,1639 08:22:07 INFO - PROCESS | 13104 | __end_cc_report 08:22:07 INFO - PROCESS | 13104 | __startTimestamp1461856927670__endTimestamp 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | ------- Summary: start ------- 08:22:07 INFO - PROCESS | 13104 | Number of tests: 14 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#0] ai-astar Cycles:10 Average:110.40 Median:112.00 stddev:3.47 (3.1%) stddev-sans-first:3.67 08:22:07 INFO - PROCESS | 13104 | Values: 111.0 112.0 107.0 110.0 114.0 112.0 102.0 112.0 112.0 112.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#1] audio-beat-detection Cycles:10 Average:153.00 Median:160.00 stddev:22.19 (13.9%) stddev-sans-first:23.10 08:22:07 INFO - PROCESS | 13104 | Values: 165.0 124.0 154.0 182.0 130.0 155.0 167.0 130.0 186.0 137.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#2] audio-dft Cycles:10 Average:161.00 Median:161.50 stddev:1.25 (0.8%) stddev-sans-first:1.27 08:22:07 INFO - PROCESS | 13104 | Values: 162.0 160.0 160.0 159.0 160.0 162.0 163.0 161.0 162.0 161.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#3] audio-fft Cycles:10 Average:90.90 Median:74.00 stddev:22.07 (29.8%) stddev-sans-first:22.64 08:22:07 INFO - PROCESS | 13104 | Values: 75.0 74.0 113.0 108.0 74.0 74.0 72.0 126.0 117.0 76.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#4] audio-oscillator Cycles:10 Average:108.40 Median:93.00 stddev:24.67 (26.5%) stddev-sans-first:25.61 08:22:07 INFO - PROCESS | 13104 | Values: 94.0 93.0 149.0 93.0 94.0 93.0 140.0 93.0 92.0 143.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.57 (0.5%) stddev-sans-first:0.60 08:22:07 INFO - PROCESS | 13104 | Values: 117.0 117.0 117.0 117.0 117.0 117.0 118.0 116.0 116.0 117.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#6] imaging-darkroom Cycles:10 Average:145.20 Median:145.00 stddev:0.63 (0.4%) stddev-sans-first:0.60 08:22:07 INFO - PROCESS | 13104 | Values: 146.0 144.0 146.0 146.0 145.0 145.0 145.0 145.0 145.0 145.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#7] imaging-desaturate Cycles:10 Average:94.90 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.00 08:22:07 INFO - PROCESS | 13104 | Values: 94.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#8] json-parse-financial Cycles:10 Average:57.70 Median:57.00 stddev:4.79 (8.4%) stddev-sans-first:5.07 08:22:07 INFO - PROCESS | 13104 | Values: 57.0 57.0 57.0 56.0 56.0 57.0 57.0 71.0 54.0 55.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#9] json-stringify-tinderbox Cycles:10 Average:61.40 Median:62.00 stddev:0.70 (1.1%) stddev-sans-first:0.53 08:22:07 INFO - PROCESS | 13104 | Values: 60.0 61.0 61.0 61.0 62.0 61.0 62.0 62.0 62.0 62.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#10] stanford-crypto-aes Cycles:10 Average:78.40 Median:78.00 stddev:2.99 (3.8%) stddev-sans-first:3.16 08:22:07 INFO - PROCESS | 13104 | Values: 79.0 77.0 76.0 76.0 78.0 86.0 78.0 80.0 78.0 76.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#11] stanford-crypto-ccm Cycles:10 Average:127.50 Median:125.00 stddev:10.30 (8.2%) stddev-sans-first:10.84 08:22:07 INFO - PROCESS | 13104 | Values: 124.0 127.0 123.0 123.0 121.0 122.0 126.0 129.0 156.0 124.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:169.80 Median:170.00 stddev:2.74 (1.6%) stddev-sans-first:2.71 08:22:07 INFO - PROCESS | 13104 | Values: 167.0 170.0 171.0 176.0 170.0 169.0 172.0 168.0 167.0 168.0 08:22:07 INFO - PROCESS | 13104 | 08:22:07 INFO - PROCESS | 13104 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.60 Median:70.00 stddev:1.43 (2.0%) stddev-sans-first:1.42 08:22:07 INFO - PROCESS | 13104 | Values: 71.0 70.0 70.0 70.0 70.0 72.0 69.0 69.0 68.0 67.0 08:22:07 INFO - PROCESS | 13104 | -------- Summary: end -------- 08:22:07 INFO - PROCESS | 13104 | 08:22:08 INFO - TEST-INFO | 13104: exit 0 08:22:08 INFO - TEST-OK | kraken | took 61016ms 08:22:08 INFO - SUITE-END | took 1172s 08:22:08 INFO - Completed test suite (00:19:33) 08:22:08 INFO - javascript benchmark 08:22:08 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3084.3214492811585, 3148.5906832111823, 3184.219866132798, 3195.9840200798994, 3227.5965504311953, 5153.74231288435, 5267.841964741064, 5272.103742363798, 5292.397223758488, 5393.083175860108, 5220.947790522103, 5317.12267475866, 5325.760340784665, 5356.946430535693, 5380.596455265852, 4750.168720473912, 4784.760761961906, 4856.39295088114, 4861.781219845116, 5027.371578552681, 4933.284673722308, 4977.377827771528, 4978.701277923318, 4987.735486159318, 4995.950040499603, 4697.0, 4784.808607655689, 4852.102361063215, 4873.512648735098, 4931.235658472924, 4846.806127754886, 4859.82990595331, 4868.634852386085, 4875.0, 4904.485029071931, 4698.0, 4729.196036673774, 4736.242201247784, 4738.360321356642, 4772.832950846704, 5108.974455127701, 5122.052420302256, 5186.611004174702, 5246.685198888079, 5251.133562962106, 5678.176664383683, 5688.544916406678, 5706.80026199081, 5709.885802283931, 5715.3141623005085, 5740.512056475204, 5760.740766665468, 5769.826905192851, 5770.134479828017, 5771.192033115367, 5175.120229560984, 5227.555657769056, 5279.9208011879855, 5298.470152984748, 5305.495977882134, 5786.1610066540115, 5802.82591522255, 5804.390538993429, 5808.157817116495, 5832.650040997553, 5414.620976531605, 5578.665280083208, 5586.13414920688, 5588.329400471969, 5591.664500130005, 5593.580481463907, 5607.495325420732, 5615.157726341082, 5626.2685850839125, 5657.830265092054, 5582.525485333792, 5593.468620481048, 5600.887982240414, 5603.271574695345, 5620.185073164368, 5484.890302193934, 5616.241807356037, 5620.690862002547, 5622.887542249132, 5631.6902570359025, 4331.393604895317, 4336.1978034063795, 4341.6743744218675, 4347.7173983690955, 4373.518912919576, 3876.127871228951, 3894.883153505399, 3906.140649057203, 3911.5501717302873, 3932.036651020518, 5249.291345668286, 5271.446498117719, 5333.200019997032, 5416.756245968941, 5451.536619387317, 5667.546596272288, 5691.658500489983, 5696.572757043155, 5714.171445140514, 5753.395893431213, 5348.839534813962, 5363.517283444508, 5403.621746477709, 5404.270423492857, 5408.945910540844, 4687.484376718558, 4900.534449227318, 4900.852974410774, 4934.358533390708, 4951.653384263067, 5829.5336373090895, 5836.153757705109, 5836.358000619928, 5842.386549412336, 5852.326982396994, 5610.27066481363, 5613.607047506799, 5613.719314034363, 5614.831555053355, 5615.6630602164005, 5671.914921276267, 5733.885322293614, 5791.0, 5808.39011903744, 5812.505936995402, 5605.80379686709, 5619.241402410786, 5620.381758006534, 5620.4660557247, 5622.297212848394, 5667.1782591524825, 5678.574106942078, 5709.457601527848, 5711.029125048834, 5720.713964301685, 5337.092694242066, 5521.0, 5538.196961440488, 5575.693336866511, 5592.189132575835, 5394.78420863161, 5406.945930540644, 5407.567394608343, 5408.783648654167, 5411.567074634098, 5331.360236771612, 5353.2773075634295, 5361.544268737045, 5382.327209098863, 5433.239346491573, 5492.176173573996, 5492.395836457907, 5534.944650553443, 5538.6122971391615, 5566.415526369673, 5400.135978243462, 5433.375161856437, 5434.75543600531, 5439.864003399946, 5453.945460545502], "value": 5219.21202987882, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [604.6311749832602, 648.649729146261, 657.3623585122431, 661.9040239165321, 666.8799616069109, 31217.687823121763, 32189.51715724263, 35556.11109722255, 36571.817140914325, 36737.26525469489, 38573.42139867904, 39463.60536394635, 39506.0, 39519.40720889189, 39622.207555848865, 8446.999999999985, 8643.481391116553, 8685.044645089036, 8685.782855428602, 8695.521746303952, 7707.190744971781, 9733.415995040285, 9982.201423886072, 10001.49992500372, 10001.49992500372, 10080.899191008106, 10240.743981400487, 10261.692149235534, 10285.0, 10290.948545257263, 9995.050470205319, 10026.498675066217, 10066.14437772783, 10082.747931301703, 10094.141997930148, 9933.70198894027, 10060.647877324258, 10088.445135517544, 10093.899061009442, 10094.091531762104, 40472.0, 40631.593684063075, 40649.593504065175, 40765.0, 40839.18321633551, 3344.9832750836335, 3375.932481350384, 3396.7961922284494, 3969.6625786808154, 4292.7209731367675, 31007.689923100705, 31454.0, 31535.842320788248, 32650.510242346383, 32760.344793104243, 4197.353065329141, 4274.137785228565, 4281.785910704452, 4314.395984562164, 4339.153864996327, 336940.0, 338191.99999999756, 338607.0, 338911.0, 339739.0, 59778.0, 59974.10038849421, 60412.0, 60452.39547604468, 60515.69742151261, 53837.73081134569, 55725.72137139289, 55797.721011394686, 55938.440615593325, 62448.0, 16853.410130645614, 16919.83080169207, 17014.744778828328, 17056.147192640317, 17072.2317495713, 10105.949470252748, 12386.071044671506, 12388.56640017595, 12403.25580465175, 12742.68143296425, 18415.53961150955, 18416.0, 18497.630047399245, 18617.0, 18641.906790466233, 7029.753958611424, 7260.310270524292, 7270.0, 7316.341829085457, 7370.078740157481, 1090.5528733219342, 1094.1848322999417, 1188.316717887201, 1228.7358217983176, 1255.9309237991815, 31622.683773161974, 32473.51289730656, 32693.67306326954, 32698.509522357184, 32946.0, 1071.276888100529, 1073.6456969200144, 1076.2950267574752, 1149.3276433286453, 1166.4109624639673, 16732.813147424244, 17049.31802727902, 17088.57278568046, 17283.74074388885, 17690.203940822696, 498188.0, 503724.0, 504183.0, 507181.0, 508650.0, 57053.42946570481, 57473.0, 57566.42433575694, 57598.0, 57731.4226857726, 1348.8651134886434, 1349.4669605505967, 1370.2121280263689, 1382.654336415896, 1493.9327730252164, 27546.5868011984, 30293.848530757205, 30545.54181687321, 31223.843880780452, 31262.687373125977, 44375.11249775051, 44451.11097778091, 44771.77614111909, 44821.775891120335, 44843.55156448524, 272215.0, 272936.0, 273741.0, 274003.0, 275093.0, 22853.771462285164, 24767.50464990726, 25496.490070198863, 25510.489790204465, 25531.617025745, 39331.6066839328, 39528.209435811696, 39680.0, 40551.0, 40565.0, 37817.0, 38499.80750096231, 38517.807410963884, 39025.41461878131, 39375.40936885892, 37150.6284937158, 38251.617483824804, 38283.2343353137, 38449.80775096107, 38606.2278754429, 38481.23037539289, 38853.611463885, 38956.2208755829, 39718.404223936086, 39940.0, 31099.440575408942, 31214.21964450907, 31795.84102079475, 31890.36219275555, 32912.506312404854, 26745.197644070708, 27195.0, 27457.588136177576, 27486.725132748415, 27573.172804815888], "value": 19462.07076503267, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [390.170886865411, 393.57493906580885, 393.80113042913325, 409.96310332070107, 412.7234752715682, 14160.501530142305, 16444.588885277873, 18104.185311660975, 18616.348427805013, 18711.532211694714, 14210.92894535526, 17653.911730441363, 17819.64360712788, 17899.28402863887, 17983.100844957764, 5489.533389661873, 5530.861728456781, 5580.944190558083, 5582.330120385539, 5662.094064949609, 4064.2887494688457, 5434.565234781227, 5592.720363981805, 5620.606557540974, 5952.107183922403, 6178.567500274982, 6185.257769067718, 6191.257049154108, 6194.907076393858, 6197.0704394340755, 6111.572189946705, 6124.540659450559, 6156.015037593986, 6335.11308416822, 6346.365363463663, 5485.670859748428, 5486.3690675572425, 5566.944330556683, 5589.0219211638205, 5602.915956260659, 21197.576048478943, 21576.24483143098, 22492.43768905774, 22559.210427635117, 22636.434089147737, 2241.2939923923914, 2276.4764104256114, 2302.1712183613886, 2461.938451538708, 2675.8761320245544, 13357.465701371933, 13625.454981800814, 13809.033367664268, 13914.791278130837, 14049.71900561983, 1854.944351669452, 1909.102721720803, 1931.0730849192325, 1981.8612697111207, 1989.4827344890289, 72126.27873721249, 79582.20417795806, 80192.59903700503, 80499.0, 81246.59376703079, 10781.407022613832, 10877.129829613612, 10949.069329107115, 10976.835347469794, 11364.261323014143, 15133.0, 15180.620484487756, 15227.162506062052, 15252.237388130548, 15280.388784448498, 6833.145856767904, 7595.734149304748, 8202.753917382488, 8368.665253389918, 8481.787955301166, 7478.551286922802, 7592.582407967504, 7595.5822429765785, 7703.8844417333785, 7749.883751743729, 4665.813367465331, 4679.883002924954, 4706.88232794176, 4798.688085274516, 4808.543188397097, 1872.5768416003664, 1897.8576606754273, 1898.8385987190968, 1907.7806052303886, 1949.5321122930395, 872.9869051964225, 1009.4902074452501, 1024.8206563851297, 1066.1950227578284, 1077.6874706335232, 17495.475135745946, 17586.560335991446, 18041.54896127581, 18352.908235459003, 18571.813473570754, 962.4081190068058, 977.9217662586976, 1002.0580654185043, 1018.765683892694, 1021.3310281765456, 10311.84532232017, 10767.19246056549, 10781.9460902695, 10819.13446924244, 10822.891771082346, 475999.0, 477013.0, 483083.0, 484642.0, 484911.0, 84305.52014119063, 84393.0, 87064.56467717748, 95802.52098739462, 97345.51327243318, 1042.5673345561659, 1101.372217835826, 1103.0403548912498, 1104.6575561575937, 1157.056998546182, 15606.531804045897, 16229.350825966829, 16287.918560407123, 16432.424865129662, 16558.58603534873, 36935.63064369322, 37330.81334593309, 37540.3074615673, 37549.81225093966, 38172.618273818014, 41917.0, 44011.77994110009, 46201.07597848091, 47844.76077619729, 48949.75525122351, 7707.306342429209, 7785.688572457038, 7787.961060194662, 8137.959310203411, 8208.343332533503, 8755.387122901337, 12247.203931744409, 12600.810987835373, 12773.361331933553, 13000.154989925624, 11398.373089479826, 11453.370064646524, 11516.827247591125, 11660.650180494598, 11846.289222646668, 10728.0, 11012.779744404907, 11024.228304018963, 11244.493997770283, 11517.366544840113, 11110.555577776799, 11681.649550513499, 11709.648710538697, 11982.700432489257, 12248.632541023784, 7878.487898286593, 8373.539455330016, 8459.196376344238, 8605.268552172885, 8991.235744961752, 11249.606263780728, 11266.887331126913, 11358.716032099264, 11548.422578870855, 11625.59310424131], "value": 9041.489608676917, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1239.96900077498, 1412.7527682655536, 1453.8836893048558, 1571.8035245594301, 1752.719564869621, 7347.228541003191, 7630.351420129296, 7644.770656880296, 7657.0, 7669.34810541104, 7333.0, 7515.248475152482, 7521.210272921333, 7522.736704215354, 7525.811854703635, 1889.811018898113, 2217.301550011749, 2218.667199920013, 2262.6379779235326, 2295.908163673451, 2251.234580242717, 2251.752307246202, 2255.1430456426615, 2262.8302877284186, 2264.626336654458, 2235.932922012334, 2237.876916769585, 2275.6358982562792, 2280.600894843404, 2283.577538155438, 1928.951776205592, 1980.9306674266331, 1986.0764744393925, 2127.8723276603378, 2148.785121487854, 2209.712737344135, 2238.5746708125566, 2243.069126312578, 2248.415411992877, 2252.031626400647, 7483.8877416838795, 7554.433417493655, 7558.244175582453, 7617.733379331697, 7683.654235559413, 4591.701539399928, 4682.765861706901, 4692.929606055912, 4729.432468103815, 4729.456112547066, 2950.2181921790743, 2999.1302522268516, 3133.4673105572106, 3137.4823154179535, 3163.3673265347024, 980.1717548671361, 991.9652812151612, 1032.7727899862018, 1038.5793753529833, 1050.74256807082, 10446.0, 10954.671359859218, 10958.616448424267, 10961.342319460779, 10965.50655220509, 4242.936355954663, 4298.677599180074, 4320.675949303814, 4348.412964249849, 4464.508904020555, 9387.718368448957, 9522.285828562886, 9527.142557169887, 9531.285153613506, 9535.094166054214, 4938.259261110862, 4942.110420124341, 4980.526849949249, 4986.077575648516, 4988.052270068675, 4025.355943049098, 4362.367456718758, 4488.730676159441, 4505.842295519707, 4515.887102822456, 3780.8865734028022, 3784.262068896539, 3869.2068126034096, 3876.96123038766, 3930.449737036817, 1250.412306216077, 1267.309316422552, 1269.0989397527674, 1287.5300515311844, 1298.2729671384054, 915.8706008530194, 920.4431319052011, 942.6276620734908, 967.3953778888194, 977.5454413697664, 5343.198520221998, 5365.382980957162, 5610.214569960209, 5619.522340601013, 5779.913301300484, 409.38183343152053, 411.1448187769432, 430.0731922706572, 436.45225242321317, 439.04945792359183, 3769.8869033928477, 3776.244751049746, 3987.9631295863283, 3991.401289806552, 4012.117334186474, 9495.952520237355, 9832.01679832011, 10038.196944244442, 10043.045910638477, 10088.49557522121, 9730.270229732798, 9826.410415374958, 9842.901570984342, 9958.352707074017, 9975.301728879054, 7192.208857025723, 7342.302481264272, 7422.48042637021, 7436.3679087277105, 7448.925510744932, 5427.050266203478, 5486.369067557282, 5564.749586268546, 5646.576506761927, 5658.151277308437, 8604.913950860411, 8735.257503112307, 8814.338924580554, 8947.463152210888, 8995.730128096167, 8980.775480613036, 9053.275737940818, 9103.49930753815, 9260.39807412516, 9261.814763704553, 6223.813285601439, 6917.0, 6933.687984040831, 6977.406920411822, 7110.537815042006, 7751.224877512203, 7760.107587627269, 7778.105517865518, 7787.0, 7823.374130069467, 6603.240627327918, 6772.390484856386, 6784.559003664944, 6939.30606939302, 6948.374646281859, 6898.620575868375, 6945.652717364011, 6953.965230173817, 6955.304469553004, 7061.6469176542, 6270.9372906270355, 6282.120503129474, 6340.556161068866, 6399.6800159992745, 6410.070539771614, 4717.811287548459, 4948.084604348207, 4958.1323268428605, 4969.130402179532, 5040.571551418024, 4816.253480710496, 4853.635977301646, 4875.68308059975, 4880.511948805091, 4892.315075889307], "value": 4186.992463466038, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [302.9257831831203, 312.5561702382617, 314.16588956320965, 314.71203848478643, 318.68927795399475, 5074.898502029957, 5180.792768289273, 5233.188855727359, 5340.279062326589, 5375.731213439327, 5255.500727430897, 5274.314339135916, 5278.8122672398695, 5321.654092483986, 5327.0, 4171.979140104295, 4172.311568591179, 4173.3739939009165, 4183.6653067754505, 4188.81150348235, 3903.9804800975953, 3906.9255954612568, 4032.5160980682213, 4101.856435024774, 4209.34755112958, 4107.815148318333, 4125.2780763366445, 4150.605692459211, 4150.854720084798, 4154.709170358076, 4127.545969943304, 4129.752214867088, 4143.150654115899, 4145.97927010363, 4155.0, 3427.160345715291, 3666.138457462494, 3667.8166091695575, 3679.632036796326, 3685.9078523037138, 5063.0, 5084.415292241402, 5101.51535604117, 5105.157648987913, 5106.923396149061, 4658.953410465886, 4662.557057079572, 4668.696534725232, 4677.74272415017, 4693.741844198567, 5383.43473935239, 5412.377576578665, 5502.944970550283, 5555.611107222496, 5563.248961390201, 3890.4942357493346, 3896.045468860119, 3928.155446578999, 3937.448757173998, 3958.6437220650278, 5671.574631902624, 5717.371089180187, 5757.453041961007, 5763.308402991668, 5809.796657117023, 3868.458415821787, 3878.6121387861554, 3880.0299925018744, 3883.2427676602792, 3892.4355968384425, 3801.144742432986, 4022.8390864365097, 4028.4762980812893, 4028.939565906514, 4045.9190816183514, 4576.290674945389, 4617.7691115444095, 4624.3294722265755, 4630.490646028934, 4653.139169253699, 5268.683878967274, 5496.285482887279, 5520.309961254843, 5547.667139971614, 5549.833504994856, 1381.9221007614078, 1409.9154050756988, 1410.675544624742, 1412.498563010137, 1475.2697414779539, 962.8026254617787, 982.3467394182788, 983.7589790501373, 989.8960609136082, 990.2622546203124, 5661.971690141523, 5682.943170568324, 5687.345955215121, 5687.578105473632, 5703.800366987136, 5525.502704756591, 5802.390748971382, 5803.419658034163, 6017.849553761191, 6060.121282414026, 5385.515303622693, 5429.0, 5447.6459030163705, 5451.972740136274, 5463.262459567987, 3104.534319851995, 3216.260260140181, 3236.821974791362, 3237.1583388319204, 3245.3996010738088, 6238.719257633417, 6324.525660575383, 6378.681065946684, 6386.0, 6389.201349831271, 6249.0, 6254.655993920287, 6259.217597800275, 6285.622862628165, 6291.433770960544, 5705.2012718219485, 5937.851553711105, 5966.791162309211, 5975.713357653361, 6309.305976342599, 5690.743916523684, 5733.913991290217, 5735.56983226268, 5739.454751798739, 5739.8565035874435, 5551.390846302232, 5683.914741278802, 5686.203931449518, 5690.829275121753, 5709.286339207599, 5909.852253693692, 5930.466258036798, 5940.851478713067, 5949.494292985145, 5951.970240148771, 3982.8008599569325, 3992.7604343739467, 4006.7395619284653, 4042.676585873182, 4044.1911617675996, 5286.97356513215, 5393.244945707683, 5528.834134975958, 5797.652140871562, 5798.739056742373, 5562.833115006556, 5563.165525171256, 5600.131979543177, 5617.820257745919, 5631.662100273997, 5569.860753481195, 5581.018738347828, 5581.302337207849, 5582.413846546055, 5592.105263157875, 5270.657407268515, 5541.695206763506, 5566.109422492382, 5570.192322113352, 5571.804986825442, 5544.417836127149, 5609.214709940693, 5617.382087970238, 5682.7782026864425, 5685.687287199244, 5165.690058596496, 5531.751071201886, 5547.33431988164, 5555.916661250004, 5572.637778544544], "value": 4260.2251099549, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [687.1445050911616, 754.2495217258827, 769.1001528211991, 770.556929765385, 772.204629231891, 12082.758344833099, 12340.13619046667, 12400.0, 12410.751784964295, 12439.751204975895, 10751.462426878645, 10789.784204315909, 10793.676189714302, 10799.460026998659, 10804.0, 668.5620918298522, 781.0900301149154, 811.4036183405193, 813.6216659253446, 814.2915663372873, 799.8520273749346, 801.8676918308472, 803.9397045221602, 804.388664614894, 804.4690504267185, 697.4524997876667, 831.8793774902636, 834.9123342049088, 837.4682076881163, 839.0099682374795, 713.247523862325, 719.2627556754317, 810.5015415519442, 843.6119385082808, 848.9363297752632, 623.8502759337727, 625.5871125057486, 625.8122563231058, 626.1890851347516, 626.5958456795387, 12014.219075760047, 12033.51865925362, 12047.156699030984, 12064.577739779066, 12070.456829442695, 10658.307210031324, 10881.564737410494, 11259.042981346514, 11420.771584568345, 11524.884751152465, 9521.714348569554, 9633.518324083769, 9671.854922176173, 9720.368176068532, 9749.707508774749, 3588.7661196652293, 3605.4591811228265, 3618.1678214010662, 3678.6137455567314, 3686.64976827201, 49660.0, 50481.24278135794, 50493.24260136101, 50729.98540029216, 50771.0, 9352.625894964125, 9437.150656440954, 9569.808603827885, 9611.615535378507, 9630.374025688308, 17422.303107875545, 17520.561985950455, 17535.210915508833, 17590.296388144332, 17596.38412655551, 7456.7390141344795, 7526.209747976383, 7545.434092443089, 7641.312281894656, 7971.521708697497, 4163.958360416357, 4208.053188032668, 4213.199492096492, 4317.611414972667, 4376.518582955872, 2919.8978035768646, 2967.747741442002, 2967.9554806677484, 2973.8810447582287, 2976.151796737919, 517.4799326676741, 538.6498775795686, 554.0746952589186, 557.128094532056, 557.2449331156306, 543.0, 574.3452464190826, 602.6233603997501, 656.7405874679475, 657.7862194786713, 7618.686440255127, 7970.163132871081, 8001.279884810278, 8018.5990700464745, 8117.675292988214, 634.9714262858182, 640.5356116815271, 647.2233320015905, 651.9641419721961, 654.7479220500142, 4071.267171909085, 4178.979105104455, 4262.190183865117, 4308.009157893702, 4446.710963787344, 64101.67949160318, 70708.2929170712, 73135.63432182911, 73658.0, 73727.26272737312, 48387.51612483901, 49877.0, 49968.50031499711, 50471.71933824363, 60432.69783651054, 50442.74778626157, 50621.746891265306, 50673.74663126661, 50756.74621626942, 50943.0, 8413.284870786052, 8491.405601607828, 8616.956915215384, 8662.81364110909, 8670.653173872974, 31754.52368214525, 32406.351872961935, 32460.0, 33397.16507087245, 33716.83141584276, 43753.0, 44474.55525444704, 45139.0, 45890.541094588625, 46603.30095048509, 10231.386116833013, 10294.330868493524, 10725.30285531438, 10807.0, 10994.615188468366, 11485.540578377106, 11674.70813229676, 11891.643250702493, 12164.635060948185, 12370.81443778362, 10626.89373106259, 10777.51501182433, 10880.891191088305, 10986.450677466255, 11177.944110279397, 10881.564737410416, 10892.292001019909, 11183.217174797686, 11308.321500709984, 11403.201775875941, 11092.833607496055, 11243.831342530033, 11390.829137563109, 11424.48589813477, 11527.654170374903, 8741.34439916996, 8772.385932984886, 9057.320700947586, 9093.363464557417, 9193.816123677356, 9885.357451765612, 10033.598656053968, 10071.748206294902, 10079.34484258521, 10106.140978016656], "value": 6153.310455245737, "unit": "score"}], "name": "dromaeo_css", "value": 6822.144184996927, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [111.0, 112.0, 107.0, 110.0, 114.0, 112.0, 102.0, 112.0, 112.0, 112.0], "value": 110.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 124.0, 154.0, 182.0, 130.0, 155.0, 167.0, 130.0, 186.0, 137.0], "value": 153.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 160.0, 160.0, 159.0, 160.0, 162.0, 163.0, 161.0, 162.0, 161.0], "value": 161.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 113.0, 108.0, 74.0, 74.0, 72.0, 126.0, 117.0, 76.0], "value": 90.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 93.0, 149.0, 93.0, 94.0, 93.0, 140.0, 93.0, 92.0, 143.0], "value": 108.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 118.0, 116.0, 116.0, 117.0], "value": 116.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 144.0, 146.0, 146.0, 145.0, 145.0, 145.0, 145.0, 145.0, 145.0], "value": 145.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0], "value": 94.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 57.0, 57.0, 56.0, 56.0, 57.0, 57.0, 71.0, 54.0, 55.0], "value": 57.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 61.0, 61.0, 61.0, 62.0, 61.0, 62.0, 62.0, 62.0, 62.0], "value": 61.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 77.0, 76.0, 76.0, 78.0, 86.0, 78.0, 80.0, 78.0, 76.0], "value": 78.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [124.0, 127.0, 123.0, 123.0, 121.0, 122.0, 126.0, 129.0, 156.0, 124.0], "value": 127.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 170.0, 171.0, 176.0, 170.0, 169.0, 172.0, 168.0, 167.0, 168.0], "value": 169.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 70.0, 70.0, 70.0, 70.0, 72.0, 69.0, 69.0, 68.0, 67.0], "value": 69.6, "unit": "score"}], "name": "kraken", "value": 1545.1, "alertThreshold": 2.0}]} 08:22:08 INFO - Return code: 0 08:22:08 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 08:22:08 ERROR - # TBPL SUCCESS # 08:22:08 INFO - Running post-action listener: _resource_record_post_action 08:22:08 INFO - Running post-run listener: _resource_record_post_run 08:22:10 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 126976; Write bytes: 535277568; Read time: 64; Write time: 467828 08:22:10 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 244596736; Read time: 0; Write time: 283708 08:22:10 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 126976; Write bytes: 290680832; Read time: 64; Write time: 184120 08:22:10 INFO - Running post-run listener: _upload_blobber_files 08:22:10 INFO - Blob upload gear active. 08:22:10 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 08:22:10 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 08:22:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 08:22:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 08:22:10 INFO - (blobuploader) - INFO - Open directory for files ... 08:22:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 08:22:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:22:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:22:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 08:22:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:22:11 INFO - (blobuploader) - INFO - Done attempting. 08:22:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 08:22:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 08:22:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 08:22:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 08:22:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 08:22:12 INFO - (blobuploader) - INFO - Done attempting. 08:22:12 INFO - (blobuploader) - INFO - Iteration through files over. 08:22:12 INFO - Return code: 0 08:22:12 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 08:22:12 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 08:22:12 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/03a6673bc4bc78256cb4bce046d375a258e0803886e51d6270107675d82db5beb2d1a13057c754af1dc6cb26043ee7b5b8aaaa42e17d349dfc1938279a887a4c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fb2fa799206c0f9a647797a9d8bbaae8d64c9c895e30a1df7b784c3527c12f5c3b768394805d0d8613ed888b826ae30d3faf894e032011e2492c77488e5797ac"} 08:22:12 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 08:22:12 INFO - Writing to file /builds/slave/test/properties/blobber_files 08:22:12 INFO - Contents: 08:22:12 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/03a6673bc4bc78256cb4bce046d375a258e0803886e51d6270107675d82db5beb2d1a13057c754af1dc6cb26043ee7b5b8aaaa42e17d349dfc1938279a887a4c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fb2fa799206c0f9a647797a9d8bbaae8d64c9c895e30a1df7b784c3527c12f5c3b768394805d0d8613ed888b826ae30d3faf894e032011e2492c77488e5797ac"} 08:22:12 INFO - Running post-run listener: copy_logs_to_upload_dir 08:22:12 INFO - Copying logs to upload dir... 08:22:12 INFO - mkdir: /builds/slave/test/build/upload/logs 08:22:12 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.442065 ========= master_lag: 0.24 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-04-28 08:22:12.455144) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-28 08:22:12.459373) ========= 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=0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278 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/sha512/03a6673bc4bc78256cb4bce046d375a258e0803886e51d6270107675d82db5beb2d1a13057c754af1dc6cb26043ee7b5b8aaaa42e17d349dfc1938279a887a4c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fb2fa799206c0f9a647797a9d8bbaae8d64c9c895e30a1df7b784c3527c12f5c3b768394805d0d8613ed888b826ae30d3faf894e032011e2492c77488e5797ac"} build_url:https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011157 build_url: 'https://queue.taskcluster.net/v1/task/abqn52Y9TSukNZsUxjhkHw/artifacts/public/build/firefox-48.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/03a6673bc4bc78256cb4bce046d375a258e0803886e51d6270107675d82db5beb2d1a13057c754af1dc6cb26043ee7b5b8aaaa42e17d349dfc1938279a887a4c", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/fb2fa799206c0f9a647797a9d8bbaae8d64c9c895e30a1df7b784c3527c12f5c3b768394805d0d8613ed888b826ae30d3faf894e032011e2492c77488e5797ac"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-28 08:22:12.486946) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-28 08:22:12.487351) ========= 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=0e2a256762fed810e2f0f810000001b3-1461854949.452778-717615278 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004718 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-28 08:22:12.536673) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-28 08:22:12.540006) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-28 08:22:12.540330) ========= ========= Total master_lag: 0.35 =========