builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-061 starttime: 1465161797.92 results: success (0) buildid: 20160605113024 builduid: 217a6c9b3ca74f588626834858db16d4 revision: f42a04d822baa22a4741c4fff1aab2054857e398 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:17.920705) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:17.921292) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:17.921623) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:17.961735) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:17.962025) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-05 14:23:19-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 45.7M=0s 2016-06-05 14:23:20 (45.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.110041 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:18.086135) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:18.086438) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.013973 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:18.138850) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:18.139187) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev f42a04d822baa22a4741c4fff1aab2054857e398 --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 f42a04d822baa22a4741c4fff1aab2054857e398 --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=516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-05 14:23:20,206 truncating revision to first 12 chars 2016-06-05 14:23:20,206 Setting DEBUG logging. 2016-06-05 14:23:20,206 attempt 1/10 2016-06-05 14:23:20,206 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/f42a04d822ba?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-05 14:23:20,530 unpacking tar archive at: fx-team-f42a04d822ba/testing/mozharness/ program finished with exit code 0 elapsedTime=0.701050 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:18.853755) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:18.854064) ========= script_repo_revision: f42a04d822baa22a4741c4fff1aab2054857e398 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:18.854776) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:18.855108) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-05 14:23:18.871309) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-06-05 14:23:18.871606) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 14:23:21 INFO - MultiFileLogger online at 20160605 14:23:21 in /builds/slave/test 14:23:21 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 14:23:21 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 14:23:21 INFO - {'append_to_log': False, 14:23:21 INFO - 'base_work_dir': '/builds/slave/test', 14:23:21 INFO - 'blob_upload_branch': 'Fx-Team', 14:23:21 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 14:23:21 INFO - 'branch': 'Fx-Team', 14:23:21 INFO - 'buildbot_json_path': 'buildprops.json', 14:23:21 INFO - 'config_files': ('talos/linux_config.py',), 14:23:21 INFO - 'default_actions': ('clobber', 14:23:21 INFO - 'read-buildbot-config', 14:23:21 INFO - 'download-and-extract', 14:23:21 INFO - 'populate-webroot', 14:23:21 INFO - 'create-virtualenv', 14:23:21 INFO - 'install', 14:23:21 INFO - 'run-tests'), 14:23:21 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 14:23:21 INFO - 'download_minidump_stackwalk': True, 14:23:21 INFO - 'download_symbols': 'ondemand', 14:23:21 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 14:23:21 INFO - 'tooltool.py': '/tools/tooltool.py', 14:23:21 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 14:23:21 INFO - '/tools/misc-python/virtualenv.py')}, 14:23:21 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 14:23:21 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 14:23:21 INFO - 'installer_path': 'installer.exe', 14:23:21 INFO - 'log_level': 'info', 14:23:21 INFO - 'log_name': 'talos', 14:23:21 INFO - 'log_to_console': True, 14:23:21 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 14:23:21 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 14:23:21 INFO - 'opt_config_files': (), 14:23:21 INFO - 'pip_index': False, 14:23:21 INFO - 'sps_profile': False, 14:23:21 INFO - 'sps_profile_interval': 0, 14:23:21 INFO - 'suite': 'dromaeojs-e10s', 14:23:21 INFO - 'system_bits': '32', 14:23:21 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 14:23:21 INFO - 'title': 'talos-linux64-ix-061', 14:23:21 INFO - 'tooltool_cache': '/builds/tooltool_cache', 14:23:21 INFO - 'use_talos_json': True, 14:23:21 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 14:23:21 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 14:23:21 INFO - 'work_dir': 'build'} 14:23:21 INFO - ##### 14:23:21 INFO - ##### Running clobber step. 14:23:21 INFO - ##### 14:23:21 INFO - Running pre-action listener: _resource_record_pre_action 14:23:21 INFO - Running main action method: clobber 14:23:21 INFO - rmtree: /builds/slave/test/build 14:23:21 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 14:23:22 INFO - Running post-action listener: _resource_record_post_action 14:23:22 INFO - ##### 14:23:22 INFO - ##### Finished clobber step (success) 14:23:22 INFO - ##### 14:23:22 INFO - ##### 14:23:22 INFO - ##### Running read-buildbot-config step. 14:23:22 INFO - ##### 14:23:22 INFO - Running pre-action listener: _resource_record_pre_action 14:23:22 INFO - Running main action method: read_buildbot_config 14:23:22 INFO - Using buildbot properties: 14:23:22 INFO - { 14:23:22 INFO - "project": "", 14:23:22 INFO - "product": "firefox", 14:23:22 INFO - "script_repo_revision": "production", 14:23:22 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 14:23:22 INFO - "repository": "", 14:23:22 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 14:23:22 INFO - "buildid": "20160605113024", 14:23:22 INFO - "pgo_build": "True", 14:23:22 INFO - "basedir": "/builds/slave/test", 14:23:22 INFO - "buildnumber": 422, 14:23:22 INFO - "slavename": "talos-linux64-ix-061", 14:23:22 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 14:23:22 INFO - "platform": "ubuntu64_hw", 14:23:22 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 14:23:22 INFO - "branch": "fx-team", 14:23:22 INFO - "repo_path": "integration/fx-team", 14:23:22 INFO - "revision": "f42a04d822baa22a4741c4fff1aab2054857e398", 14:23:22 INFO - "stage_platform": "linux64-pgo", 14:23:22 INFO - "builduid": "217a6c9b3ca74f588626834858db16d4", 14:23:22 INFO - "slavebuilddir": "test" 14:23:22 INFO - } 14:23:22 INFO - Found installer url https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2. 14:23:22 INFO - Running post-action listener: _resource_record_post_action 14:23:22 INFO - ##### 14:23:22 INFO - ##### Finished read-buildbot-config step (success) 14:23:22 INFO - ##### 14:23:22 INFO - ##### 14:23:22 INFO - ##### Running download-and-extract step. 14:23:22 INFO - ##### 14:23:22 INFO - Running pre-action listener: _resource_record_pre_action 14:23:22 INFO - Running main action method: download_and_extract 14:23:22 INFO - mkdir: /builds/slave/test/build/tests 14:23:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 14:23:22 INFO - https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 14:23:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 14:23:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 14:23:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 14:23:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 14:23:22 INFO - Downloaded 1361 bytes. 14:23:22 INFO - Reading from file /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.test_packages.json 14:23:22 INFO - Using the following test package requirements: 14:23:22 INFO - {u'common': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 14:23:22 INFO - u'cppunittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 14:23:22 INFO - u'firefox-49.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 14:23:22 INFO - u'gtest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 14:23:22 INFO - u'firefox-49.0a1.en-US.linux-x86_64.gtest.tests.zip'], 14:23:22 INFO - u'jittest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 14:23:22 INFO - u'jsshell-linux-x86_64.zip'], 14:23:22 INFO - u'mochitest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 14:23:22 INFO - u'firefox-49.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 14:23:22 INFO - u'mozbase': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'], 14:23:22 INFO - u'reftest': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 14:23:22 INFO - u'firefox-49.0a1.en-US.linux-x86_64.reftest.tests.zip'], 14:23:22 INFO - u'talos': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 14:23:22 INFO - u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'], 14:23:22 INFO - u'web-platform': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 14:23:22 INFO - u'firefox-49.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 14:23:22 INFO - u'xpcshell': [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 14:23:22 INFO - u'firefox-49.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 14:23:22 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 14:23:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 14:23:22 INFO - https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 14:23:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 14:23:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 14:23:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 14:23:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:23:23 INFO - Downloaded 24440907 bytes. 14:23:23 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 14:23:23 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 14:23:24 INFO - Return code: 0 14:23:24 INFO - Downloading packages: [u'firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 14:23:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 14:23:24 INFO - https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 14:23:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 14:23:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 14:23:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip 14:23:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:23:29 INFO - Downloaded 24440907 bytes. 14:23:29 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 14:23:29 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 14:23:30 INFO - Return code: 0 14:23:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 14:23:30 INFO - https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 14:23:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 14:23:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 14:23:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip 14:23:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 14:23:32 INFO - Downloaded 10833369 bytes. 14:23:32 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 14:23:32 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 14:23:32 INFO - Return code: 0 14:23:32 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')]} 14:23:32 INFO - https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 14:23:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 14:23:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 14:23:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 14:23:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 14:23:34 INFO - Downloaded 59138690 bytes. 14:23:34 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 14:23:34 INFO - mkdir: /builds/slave/test/properties 14:23:34 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 14:23:34 INFO - Writing to file /builds/slave/test/properties/build_url 14:23:34 INFO - Contents: 14:23:34 INFO - build_url:https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 14:23:35 INFO - Running post-action listener: _resource_record_post_action 14:23:35 INFO - Running post-action listener: set_extra_try_arguments 14:23:35 INFO - ##### 14:23:35 INFO - ##### Finished download-and-extract step (success) 14:23:35 INFO - ##### 14:23:35 INFO - ##### 14:23:35 INFO - ##### Running populate-webroot step. 14:23:35 INFO - ##### 14:23:35 INFO - Running pre-action listener: _resource_record_pre_action 14:23:35 INFO - Running main action method: populate_webroot 14:23:35 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 14:23:35 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 14:23:35 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 14:23:35 INFO - '--tppagecycles', 14:23:35 INFO - '7'], 14:23:35 INFO - 'tests': ['tsvgm']}}, 14:23:35 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['tresize', 'tcanvasmark']}, 14:23:35 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 14:23:35 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['dromaeo_css', 'kraken']}, 14:23:35 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 14:23:35 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:23:35 INFO - 'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:23:35 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:23:35 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:23:35 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:23:35 INFO - 'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['damp', 'tps']}, 14:23:35 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:23:35 INFO - 'tests': ['damp', 'tps']}, 14:23:35 INFO - 'g3': {'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['dromaeo_dom']}, 14:23:35 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 14:23:35 INFO - 'other': {'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['a11yr', 14:23:35 INFO - 'ts_paint', 14:23:35 INFO - 'tpaint', 14:23:35 INFO - 'sessionrestore', 14:23:35 INFO - 'sessionrestore_no_auto_restore', 14:23:35 INFO - 'tabpaint']}, 14:23:35 INFO - 'other-e10s': {'tests': ['a11yr', 14:23:35 INFO - 'ts_paint', 14:23:35 INFO - 'tpaint', 14:23:35 INFO - 'sessionrestore', 14:23:35 INFO - 'sessionrestore_no_auto_restore', 14:23:35 INFO - 'tabpaint']}, 14:23:35 INFO - 'other-e10s_l64': {'tests': ['a11yr', 14:23:35 INFO - 'ts_paint', 14:23:35 INFO - 'tpaint', 14:23:35 INFO - 'sessionrestore', 14:23:35 INFO - 'sessionrestore_no_auto_restore', 14:23:35 INFO - 'tabpaint']}, 14:23:35 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 14:23:35 INFO - 'ts_paint', 14:23:35 INFO - 'tpaint', 14:23:35 INFO - 'sessionrestore', 14:23:35 INFO - 'sessionrestore_no_auto_restore', 14:23:35 INFO - 'tabpaint']}, 14:23:35 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['a11yr', 14:23:35 INFO - 'ts_paint', 14:23:35 INFO - 'tpaint', 14:23:35 INFO - 'sessionrestore', 14:23:35 INFO - 'sessionrestore_no_auto_restore', 14:23:35 INFO - 'tabpaint']}, 14:23:35 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['a11yr', 14:23:35 INFO - 'ts_paint', 14:23:35 INFO - 'tpaint', 14:23:35 INFO - 'sessionrestore', 14:23:35 INFO - 'sessionrestore_no_auto_restore', 14:23:35 INFO - 'tabpaint']}, 14:23:35 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['tsvgx', 14:23:35 INFO - 'tsvgr_opacity', 14:23:35 INFO - 'tart', 14:23:35 INFO - 'tscrollx', 14:23:35 INFO - 'cart']}, 14:23:35 INFO - 'svgr-e10s': {'tests': ['tsvgx', 14:23:35 INFO - 'tsvgr_opacity', 14:23:35 INFO - 'tart', 14:23:35 INFO - 'tscrollx', 14:23:35 INFO - 'cart']}, 14:23:35 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:23:35 INFO - 'talos_options': ['--disable-e10s'], 14:23:35 INFO - 'tests': ['tp5o']}, 14:23:35 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:23:35 INFO - 'tests': ['tp5o']}, 14:23:35 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:23:35 INFO - 'talos_options': ['--disable-e10s', 14:23:35 INFO - '--xperf_path', 14:23:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:23:35 INFO - 'tests': ['tp5n']}, 14:23:35 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:23:35 INFO - 'talos_options': ['--xperf_path', 14:23:35 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:23:35 INFO - 'tests': ['tp5n']}}, 14:23:35 INFO - 'talos.zip': {'path': '', 14:23:35 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 14:23:35 INFO - Running post-action listener: _resource_record_post_action 14:23:35 INFO - ##### 14:23:35 INFO - ##### Finished populate-webroot step (success) 14:23:35 INFO - ##### 14:23:35 INFO - ##### 14:23:35 INFO - ##### Running create-virtualenv step. 14:23:35 INFO - ##### 14:23:35 INFO - Running pre-action listener: _resource_record_pre_action 14:23:35 INFO - Running main action method: create_virtualenv 14:23:35 INFO - Creating virtualenv /builds/slave/test/build/venv 14:23:35 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 14:23:35 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 14:23:35 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 14:23:35 INFO - Using real prefix '/usr' 14:23:35 INFO - New python executable in /builds/slave/test/build/venv/bin/python 14:23:35 INFO - Installing distribute.............................................................................................................................................................................................done. 14:23:37 INFO - Installing pip.................done. 14:23:37 INFO - Return code: 0 14:23:37 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 14:23: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')]} 14:23:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23: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')]} 14:23:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:37 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 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23:37 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 14:23:37 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 14:23:37 INFO - Using env: {'DISPLAY': ':0', 14:23:37 INFO - 'HOME': '/home/cltbld', 14:23:37 INFO - 'LANG': 'en_US.UTF-8', 14:23:37 INFO - 'LANGUAGE': 'en_US:en', 14:23:37 INFO - 'LOGNAME': 'cltbld', 14:23:37 INFO - 'MAIL': '/var/mail/cltbld', 14:23:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:37 INFO - 'MOZ_NO_REMOTE': '1', 14:23:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:37 INFO - 'NO_EM_RESTART': '1', 14:23:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:37 INFO - 'PWD': '/builds/slave/test', 14:23:37 INFO - 'SHELL': '/bin/bash', 14:23:37 INFO - 'SHLVL': '1', 14:23:37 INFO - 'TERM': 'linux', 14:23:37 INFO - 'TMOUT': '86400', 14:23:37 INFO - 'USER': 'cltbld', 14:23:37 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:37 INFO - '_': '/tools/buildbot/bin/python'} 14:23:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:37 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 14:23:37 INFO - Cleaning up... 14:23:37 INFO - Return code: 0 14:23:37 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 14:23: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')]} 14:23:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23: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')]} 14:23:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:37 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 14:23:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 14:23:37 INFO - Using env: {'DISPLAY': ':0', 14:23:37 INFO - 'HOME': '/home/cltbld', 14:23:37 INFO - 'LANG': 'en_US.UTF-8', 14:23:37 INFO - 'LANGUAGE': 'en_US:en', 14:23:37 INFO - 'LOGNAME': 'cltbld', 14:23:37 INFO - 'MAIL': '/var/mail/cltbld', 14:23:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:37 INFO - 'MOZ_NO_REMOTE': '1', 14:23:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:37 INFO - 'NO_EM_RESTART': '1', 14:23:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:37 INFO - 'PWD': '/builds/slave/test', 14:23:37 INFO - 'SHELL': '/bin/bash', 14:23:37 INFO - 'SHLVL': '1', 14:23:37 INFO - 'TERM': 'linux', 14:23:37 INFO - 'TMOUT': '86400', 14:23:37 INFO - 'USER': 'cltbld', 14:23:37 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:37 INFO - '_': '/tools/buildbot/bin/python'} 14:23:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:38 INFO - Downloading/unpacking psutil>=3.1.1 14:23:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:23:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:23:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:23:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:23:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:23:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:23:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 14:23:40 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:23:40 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:23:40 INFO - Installing collected packages: psutil 14:23:40 INFO - Running setup.py install for psutil 14:23:40 INFO - building 'psutil._psutil_linux' extension 14:23:40 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 14:23:40 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 14:23:40 INFO - building 'psutil._psutil_posix' extension 14:23:40 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 14:23:40 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 14:23:40 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:23:40 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:23:40 INFO - Successfully installed psutil 14:23:40 INFO - Cleaning up... 14:23:40 INFO - Return code: 0 14:23:40 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 14:23:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 14:23:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 14:23:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:40 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 14:23:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 14:23:40 INFO - Using env: {'DISPLAY': ':0', 14:23:40 INFO - 'HOME': '/home/cltbld', 14:23:40 INFO - 'LANG': 'en_US.UTF-8', 14:23:40 INFO - 'LANGUAGE': 'en_US:en', 14:23:40 INFO - 'LOGNAME': 'cltbld', 14:23:40 INFO - 'MAIL': '/var/mail/cltbld', 14:23:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:40 INFO - 'MOZ_NO_REMOTE': '1', 14:23:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:40 INFO - 'NO_EM_RESTART': '1', 14:23:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:40 INFO - 'PWD': '/builds/slave/test', 14:23:40 INFO - 'SHELL': '/bin/bash', 14:23:40 INFO - 'SHLVL': '1', 14:23:40 INFO - 'TERM': 'linux', 14:23:40 INFO - 'TMOUT': '86400', 14:23:40 INFO - 'USER': 'cltbld', 14:23:40 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:40 INFO - '_': '/tools/buildbot/bin/python'} 14:23:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:40 INFO - Downloading/unpacking mozsystemmonitor==0.3 14:23:40 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 14:23:40 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 14:23:40 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 14:23:40 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 14:23:40 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 14:23:40 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 14:23:42 INFO - Downloading mozsystemmonitor-0.3.tar.gz 14:23:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 14:23:42 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 14:23:42 INFO - Installing collected packages: mozsystemmonitor 14:23:42 INFO - Running setup.py install for mozsystemmonitor 14:23:42 INFO - Successfully installed mozsystemmonitor 14:23:42 INFO - Cleaning up... 14:23:42 INFO - Return code: 0 14:23:42 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 14:23: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')]} 14:23:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23: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')]} 14:23:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 14:23:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 14:23:42 INFO - Using env: {'DISPLAY': ':0', 14:23:42 INFO - 'HOME': '/home/cltbld', 14:23:42 INFO - 'LANG': 'en_US.UTF-8', 14:23:42 INFO - 'LANGUAGE': 'en_US:en', 14:23:42 INFO - 'LOGNAME': 'cltbld', 14:23:42 INFO - 'MAIL': '/var/mail/cltbld', 14:23:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:42 INFO - 'MOZ_NO_REMOTE': '1', 14:23:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:42 INFO - 'NO_EM_RESTART': '1', 14:23:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:42 INFO - 'PWD': '/builds/slave/test', 14:23:42 INFO - 'SHELL': '/bin/bash', 14:23:42 INFO - 'SHLVL': '1', 14:23:43 INFO - 'TERM': 'linux', 14:23:43 INFO - 'TMOUT': '86400', 14:23:43 INFO - 'USER': 'cltbld', 14:23:43 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:43 INFO - '_': '/tools/buildbot/bin/python'} 14:23:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:43 INFO - Downloading/unpacking jsonschema==2.5.1 14:23:43 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 14:23:43 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 14:23:43 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 14:23:43 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 14:23:43 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 14:23:43 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 14:23:45 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 14:23:45 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 14:23:45 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 14:23:45 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 14:23:45 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 14:23:45 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 14:23:45 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 14:23:45 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 14:23:45 INFO - Downloading functools32-3.2.3-2.tar.gz 14:23:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 14:23:45 INFO - warning: no files found matching '*.txt' 14:23:45 INFO - no previously-included directories found matching 'build' 14:23:45 INFO - no previously-included directories found matching 'dist' 14:23:45 INFO - no previously-included directories found matching '.git*' 14:23:45 INFO - Installing collected packages: jsonschema, functools32 14:23:45 INFO - Running setup.py install for functools32 14:23:45 INFO - warning: no files found matching '*.txt' 14:23:45 INFO - no previously-included directories found matching 'build' 14:23:45 INFO - no previously-included directories found matching 'dist' 14:23:45 INFO - no previously-included directories found matching '.git*' 14:23:45 INFO - Successfully installed jsonschema functools32 14:23:45 INFO - Cleaning up... 14:23:45 INFO - Return code: 0 14:23:45 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 14:23:45 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')]} 14:23:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:45 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')]} 14:23:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:45 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 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23:45 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 14:23:45 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 14:23:45 INFO - Using env: {'DISPLAY': ':0', 14:23:45 INFO - 'HOME': '/home/cltbld', 14:23:45 INFO - 'LANG': 'en_US.UTF-8', 14:23:45 INFO - 'LANGUAGE': 'en_US:en', 14:23:45 INFO - 'LOGNAME': 'cltbld', 14:23:45 INFO - 'MAIL': '/var/mail/cltbld', 14:23:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:45 INFO - 'MOZ_NO_REMOTE': '1', 14:23:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:45 INFO - 'NO_EM_RESTART': '1', 14:23:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:45 INFO - 'PWD': '/builds/slave/test', 14:23:45 INFO - 'SHELL': '/bin/bash', 14:23:45 INFO - 'SHLVL': '1', 14:23:45 INFO - 'TERM': 'linux', 14:23:45 INFO - 'TMOUT': '86400', 14:23:45 INFO - 'USER': 'cltbld', 14:23:45 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:45 INFO - '_': '/tools/buildbot/bin/python'} 14:23:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:45 INFO - Downloading/unpacking blobuploader==1.2.4 14:23:45 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 14:23:45 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 14:23:45 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 14:23:45 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 14:23:45 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 14:23:45 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 14:23:47 INFO - Downloading blobuploader-1.2.4.tar.gz 14:23:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 14:23:47 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 14:23:47 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 14:23:47 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 14:23:47 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 14:23:47 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 14:23:47 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 14:23:47 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 14:23:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 14:23:48 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 14:23:48 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 14:23:48 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 14:23:48 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 14:23:48 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 14:23:48 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 14:23:48 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 14:23:48 INFO - Downloading docopt-0.6.1.tar.gz 14:23:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 14:23:48 INFO - Installing collected packages: blobuploader, requests, docopt 14:23:48 INFO - Running setup.py install for blobuploader 14:23:48 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 14:23:48 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 14:23:48 INFO - Running setup.py install for requests 14:23:48 INFO - Running setup.py install for docopt 14:23:48 INFO - Successfully installed blobuploader requests docopt 14:23:48 INFO - Cleaning up... 14:23:49 INFO - Return code: 0 14:23:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:23: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')]} 14:23:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:49 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23: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')]} 14:23:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:49 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:49 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 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23:49 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 14:23:49 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 14:23:49 INFO - Using env: {'DISPLAY': ':0', 14:23:49 INFO - 'HOME': '/home/cltbld', 14:23:49 INFO - 'LANG': 'en_US.UTF-8', 14:23:49 INFO - 'LANGUAGE': 'en_US:en', 14:23:49 INFO - 'LOGNAME': 'cltbld', 14:23:49 INFO - 'MAIL': '/var/mail/cltbld', 14:23:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:49 INFO - 'MOZ_NO_REMOTE': '1', 14:23:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:49 INFO - 'NO_EM_RESTART': '1', 14:23:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:49 INFO - 'PWD': '/builds/slave/test', 14:23:49 INFO - 'SHELL': '/bin/bash', 14:23:49 INFO - 'SHLVL': '1', 14:23:49 INFO - 'TERM': 'linux', 14:23:49 INFO - 'TMOUT': '86400', 14:23:49 INFO - 'USER': 'cltbld', 14:23:49 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:49 INFO - '_': '/tools/buildbot/bin/python'} 14:23:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:23:49 INFO - Running setup.py (path:/tmp/pip-zRYGza-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:23:49 INFO - Running setup.py (path:/tmp/pip-32gPfb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:23:49 INFO - Running setup.py (path:/tmp/pip-Sq0gxv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:23:49 INFO - Running setup.py (path:/tmp/pip-FW30QG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:23:49 INFO - Running setup.py (path:/tmp/pip-Etf18G-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:23:49 INFO - Running setup.py (path:/tmp/pip-f_sNmf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:23:49 INFO - Running setup.py (path:/tmp/pip-RQEtm3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:23:49 INFO - Running setup.py (path:/tmp/pip-V7aiWA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:23:49 INFO - Running setup.py (path:/tmp/pip-MGWgIu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:23:49 INFO - Running setup.py (path:/tmp/pip-NkjJbi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:23:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:23:49 INFO - Running setup.py (path:/tmp/pip-mT3Rvb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:23:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:23:50 INFO - Running setup.py (path:/tmp/pip-_hnnTW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:23:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:23:50 INFO - Running setup.py (path:/tmp/pip-7NoiPT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:23:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:23:50 INFO - Running setup.py (path:/tmp/pip-Dp_w2j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:23:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:23:50 INFO - Running setup.py (path:/tmp/pip-fZQl79-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:23:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:23:50 INFO - Running setup.py (path:/tmp/pip-Fq92VD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:23:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:23:50 INFO - Running setup.py (path:/tmp/pip-DahzBE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:23:50 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 14:23:50 INFO - Running setup.py install for manifestparser 14:23:50 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 14:23:50 INFO - Running setup.py install for mozcrash 14:23:50 INFO - Running setup.py install for mozdebug 14:23:50 INFO - Running setup.py install for mozdevice 14:23:50 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 14:23:50 INFO - Installing dm script to /builds/slave/test/build/venv/bin 14:23:50 INFO - Running setup.py install for mozfile 14:23:50 INFO - Running setup.py install for mozhttpd 14:23:51 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Running setup.py install for mozinfo 14:23:51 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Running setup.py install for mozInstall 14:23:51 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Running setup.py install for mozleak 14:23:51 INFO - Running setup.py install for mozlog 14:23:51 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Running setup.py install for moznetwork 14:23:51 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Running setup.py install for mozprocess 14:23:51 INFO - Running setup.py install for mozprofile 14:23:51 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Running setup.py install for mozrunner 14:23:51 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 14:23:51 INFO - Running setup.py install for mozscreenshot 14:23:52 INFO - Running setup.py install for moztest 14:23:52 INFO - Running setup.py install for mozversion 14:23:52 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 14:23:52 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 14:23:52 INFO - Cleaning up... 14:23:52 INFO - Return code: 0 14:23:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:23:52 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')]} 14:23:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:52 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')]} 14:23:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:52 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 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23:52 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 14:23:52 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 14:23:52 INFO - Using env: {'DISPLAY': ':0', 14:23:52 INFO - 'HOME': '/home/cltbld', 14:23:52 INFO - 'LANG': 'en_US.UTF-8', 14:23:52 INFO - 'LANGUAGE': 'en_US:en', 14:23:52 INFO - 'LOGNAME': 'cltbld', 14:23:52 INFO - 'MAIL': '/var/mail/cltbld', 14:23:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:52 INFO - 'MOZ_NO_REMOTE': '1', 14:23:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:52 INFO - 'NO_EM_RESTART': '1', 14:23:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:52 INFO - 'PWD': '/builds/slave/test', 14:23:52 INFO - 'SHELL': '/bin/bash', 14:23:52 INFO - 'SHLVL': '1', 14:23:52 INFO - 'TERM': 'linux', 14:23:52 INFO - 'TMOUT': '86400', 14:23:52 INFO - 'USER': 'cltbld', 14:23:52 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:52 INFO - '_': '/tools/buildbot/bin/python'} 14:23:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 14:23:52 INFO - Running setup.py (path:/tmp/pip-lSGMOu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 14:23:52 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)) 14:23:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 14:23:52 INFO - Running setup.py (path:/tmp/pip-Qm7JKj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 14:23:52 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)) 14:23:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 14:23:52 INFO - Running setup.py (path:/tmp/pip-OB9H7H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 14:23:52 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)) 14:23:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 14:23:52 INFO - Running setup.py (path:/tmp/pip-qlbxt8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 14:23:52 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)) 14:23:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 14:23:52 INFO - Running setup.py (path:/tmp/pip-aT3HBo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 14:23:52 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)) 14:23:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 14:23:52 INFO - Running setup.py (path:/tmp/pip-4dLaSy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 14:23:52 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)) 14:23:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 14:23:52 INFO - Running setup.py (path:/tmp/pip-Ws2SR_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 14:23:52 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)) 14:23:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 14:23:52 INFO - Running setup.py (path:/tmp/pip-foBsZp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 14:23:53 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)) 14:23:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 14:23:53 INFO - Running setup.py (path:/tmp/pip-9sfuHA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 14:23:53 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)) 14:23:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 14:23:53 INFO - Running setup.py (path:/tmp/pip-wKmYjN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 14:23:53 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 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)) 14:23:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 14:23:53 INFO - Running setup.py (path:/tmp/pip-K04UYA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 14:23:53 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)) 14:23:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 14:23:53 INFO - Running setup.py (path:/tmp/pip-Z_oeYD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 14:23:53 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)) 14:23:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 14:23:53 INFO - Running setup.py (path:/tmp/pip-NROyI1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 14:23:53 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)) 14:23:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 14:23:53 INFO - Running setup.py (path:/tmp/pip-0Tgsw_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 14:23:53 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)) 14:23:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 14:23:53 INFO - Running setup.py (path:/tmp/pip-G5EV1K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 14:23:53 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)) 14:23:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 14:23:53 INFO - Running setup.py (path:/tmp/pip-kAkfzp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 14:23:53 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)) 14:23:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 14:23:53 INFO - Running setup.py (path:/tmp/pip-6iXZlb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 14:23:53 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)) 14:23:53 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)) 14:23:53 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)) 14:23:53 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)) 14:23:53 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)) 14:23:53 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)) 14:23:53 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 14:23:53 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 14:23:53 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 14:23:53 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 14:23:53 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 14:23:53 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 14:23:53 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 14:23:55 INFO - Downloading blessings-1.6.tar.gz 14:23:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 14:23:55 INFO - Installing collected packages: blessings 14:23:55 INFO - Running setup.py install for blessings 14:23:55 INFO - Successfully installed blessings 14:23:55 INFO - Cleaning up... 14:23:55 INFO - Return code: 0 14:23:55 INFO - Done creating virtualenv /builds/slave/test/build/venv. 14:23:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:23:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:23:56 INFO - Reading from file tmpfile_stdout 14:23:56 INFO - Current package versions: 14:23:56 INFO - argparse == 1.2.1 14:23:56 INFO - blessings == 1.6 14:23:56 INFO - blobuploader == 1.2.4 14:23:56 INFO - docopt == 0.6.1 14:23:56 INFO - functools32 == 3.2.3-2 14:23:56 INFO - jsonschema == 2.5.1 14:23:56 INFO - manifestparser == 1.1 14:23:56 INFO - mozInstall == 1.12 14:23:56 INFO - mozcrash == 0.17 14:23:56 INFO - mozdebug == 0.1 14:23:56 INFO - mozdevice == 0.48 14:23:56 INFO - mozfile == 1.2 14:23:56 INFO - mozhttpd == 0.7 14:23:56 INFO - mozinfo == 0.9 14:23:56 INFO - mozleak == 0.1 14:23:56 INFO - mozlog == 3.2 14:23:56 INFO - moznetwork == 0.27 14:23:56 INFO - mozprocess == 0.22 14:23:56 INFO - mozprofile == 0.28 14:23:56 INFO - mozrunner == 6.11 14:23:56 INFO - mozscreenshot == 0.1 14:23:56 INFO - mozsystemmonitor == 0.3 14:23:56 INFO - moztest == 0.7 14:23:56 INFO - mozversion == 1.4 14:23:56 INFO - psutil == 3.1.1 14:23:56 INFO - requests == 1.2.3 14:23:56 INFO - wsgiref == 0.1.2 14:23:56 INFO - Installing None into virtualenv /builds/slave/test/build/venv 14:23: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')]} 14:23:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23: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')]} 14:23:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23:56 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 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23:56 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 14:23:56 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 14:23:56 INFO - Using env: {'DISPLAY': ':0', 14:23:56 INFO - 'HOME': '/home/cltbld', 14:23:56 INFO - 'LANG': 'en_US.UTF-8', 14:23:56 INFO - 'LANGUAGE': 'en_US:en', 14:23:56 INFO - 'LOGNAME': 'cltbld', 14:23:56 INFO - 'MAIL': '/var/mail/cltbld', 14:23:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:56 INFO - 'MOZ_NO_REMOTE': '1', 14:23:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:56 INFO - 'NO_EM_RESTART': '1', 14:23:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:56 INFO - 'PWD': '/builds/slave/test', 14:23:56 INFO - 'SHELL': '/bin/bash', 14:23:56 INFO - 'SHLVL': '1', 14:23:56 INFO - 'TERM': 'linux', 14:23:56 INFO - 'TMOUT': '86400', 14:23:56 INFO - 'USER': 'cltbld', 14:23:56 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:56 INFO - '_': '/tools/buildbot/bin/python'} 14:23:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:56 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)) 14:23:56 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)) 14:23:56 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)) 14:23:56 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)) 14:23:56 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)) 14:23:56 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)) 14:23:56 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)) 14:23:56 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)) 14:23:56 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)) 14:23:56 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)) 14:23:56 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)) 14:23:56 INFO - Cleaning up... 14:23:56 INFO - Return code: 0 14:23:56 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 14:23: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')]} 14:23:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23: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')]} 14:23:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23: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', 'jsonschema'] in /builds/slave/test/build 14:23: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 jsonschema 14:23:56 INFO - Using env: {'DISPLAY': ':0', 14:23:56 INFO - 'HOME': '/home/cltbld', 14:23:56 INFO - 'LANG': 'en_US.UTF-8', 14:23:56 INFO - 'LANGUAGE': 'en_US:en', 14:23:56 INFO - 'LOGNAME': 'cltbld', 14:23:56 INFO - 'MAIL': '/var/mail/cltbld', 14:23:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:56 INFO - 'MOZ_NO_REMOTE': '1', 14:23:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:56 INFO - 'NO_EM_RESTART': '1', 14:23:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:56 INFO - 'PWD': '/builds/slave/test', 14:23:56 INFO - 'SHELL': '/bin/bash', 14:23:56 INFO - 'SHLVL': '1', 14:23:56 INFO - 'TERM': 'linux', 14:23:56 INFO - 'TMOUT': '86400', 14:23:56 INFO - 'USER': 'cltbld', 14:23:56 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:56 INFO - '_': '/tools/buildbot/bin/python'} 14:23:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:56 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 14:23:56 INFO - Cleaning up... 14:23:56 INFO - Return code: 0 14:23:56 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 14:23: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')]} 14:23:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:23:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23: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')]} 14:23:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:23:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:23: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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd8a461df10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28b88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2986a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, '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': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', '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 14:23: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', 'flake8'] in /builds/slave/test/build 14:23: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 flake8 14:23:56 INFO - Using env: {'DISPLAY': ':0', 14:23:56 INFO - 'HOME': '/home/cltbld', 14:23:56 INFO - 'LANG': 'en_US.UTF-8', 14:23:56 INFO - 'LANGUAGE': 'en_US:en', 14:23:56 INFO - 'LOGNAME': 'cltbld', 14:23:56 INFO - 'MAIL': '/var/mail/cltbld', 14:23:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:23:56 INFO - 'MOZ_NO_REMOTE': '1', 14:23:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:23:56 INFO - 'NO_EM_RESTART': '1', 14:23:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:23:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:23:56 INFO - 'PWD': '/builds/slave/test', 14:23:56 INFO - 'SHELL': '/bin/bash', 14:23:56 INFO - 'SHLVL': '1', 14:23:56 INFO - 'TERM': 'linux', 14:23:56 INFO - 'TMOUT': '86400', 14:23:56 INFO - 'USER': 'cltbld', 14:23:56 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:23:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:23:56 INFO - '_': '/tools/buildbot/bin/python'} 14:23:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:23:56 INFO - Downloading/unpacking flake8 14:23: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 14:23: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 14:23: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 14:23: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 14:23: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 14:23: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 14:23:58 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 14:23:58 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 14:23:58 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 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 14:23:58 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 14:23:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 14:23:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 14:23:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 14:23:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 14:23:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 14:23:59 INFO - no previously-included directories found matching 'docs/_build' 14:23:59 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 14:23:59 INFO - Running setup.py install for pep8 14:23:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 14:23:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 14:23:59 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 14:23:59 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 14:23:59 INFO - no previously-included directories found matching 'docs/_build' 14:23:59 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 14:23:59 INFO - Successfully installed flake8 mccabe pyflakes pep8 14:23:59 INFO - Cleaning up... 14:23:59 INFO - Return code: 0 14:23:59 INFO - Running post-action listener: _resource_record_post_action 14:23:59 INFO - Running post-action listener: _start_resource_monitoring 14:23:59 INFO - Starting resource monitoring. 14:23:59 INFO - ##### 14:23:59 INFO - ##### Finished create-virtualenv step (success) 14:23:59 INFO - ##### 14:23:59 INFO - ##### 14:23:59 INFO - ##### Running install step. 14:23:59 INFO - ##### 14:23:59 INFO - Running pre-action listener: _resource_record_pre_action 14:23:59 INFO - Running main action method: install 14:23:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 14:23:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 14:23:59 INFO - Reading from file tmpfile_stdout 14:23:59 INFO - Detecting whether we're running mozinstall >=1.0... 14:23:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 14:23:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 14:23:59 INFO - Reading from file tmpfile_stdout 14:23:59 INFO - Output received: 14:23:59 INFO - Usage: mozinstall [options] installer 14:23:59 INFO - Options: 14:23:59 INFO - -h, --help show this help message and exit 14:23:59 INFO - -d DEST, --destination=DEST 14:23:59 INFO - Directory to install application into. [default: 14:23:59 INFO - "/builds/slave/test"] 14:23:59 INFO - --app=APP Application being installed. [default: firefox] 14:23:59 INFO - mkdir: /builds/slave/test/build/application 14:23:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 14:23:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 14:24:16 INFO - Reading from file tmpfile_stdout 14:24:16 INFO - Output received: 14:24:16 INFO - /builds/slave/test/build/application/firefox/firefox 14:24:16 INFO - Running post-action listener: _resource_record_post_action 14:24:16 INFO - ##### 14:24:16 INFO - ##### Finished install step (success) 14:24:16 INFO - ##### 14:24:16 INFO - ##### 14:24:16 INFO - ##### Running run-tests step. 14:24:16 INFO - ##### 14:24:16 INFO - Running pre-action listener: _resource_record_pre_action 14:24:16 INFO - Running main action method: run_tests 14:24:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 14:24:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 14:24:16 INFO - Python 2.7.3 14:24:16 INFO - Return code: 0 14:24:16 INFO - grabbing minidump binary from tooltool 14:24:16 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')]} 14:24:16 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2983d00>, '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 0x2984ab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2984f60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 14:24:16 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 14:24:16 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 14:24:16 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 14:24:16 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 14:24:16 INFO - Return code: 0 14:24:16 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 14:24:16 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 14:24:16 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 14:24:16 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 14:24:16 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 14:24:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 14:24:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 14:24:17 INFO - Return code: 0 14:24:17 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 14:24:17 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-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-061 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 14:24:17 INFO - Using env: {'DISPLAY': ':0', 14:24:17 INFO - 'HOME': '/home/cltbld', 14:24:17 INFO - 'LANG': 'en_US.UTF-8', 14:24:17 INFO - 'LANGUAGE': 'en_US:en', 14:24:17 INFO - 'LOGNAME': 'cltbld', 14:24:17 INFO - 'MAIL': '/var/mail/cltbld', 14:24:17 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 14:24:17 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 14:24:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:24:17 INFO - 'MOZ_NO_REMOTE': '1', 14:24:17 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 14:24:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:24:17 INFO - 'NO_EM_RESTART': '1', 14:24:17 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:24:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 14:24:17 INFO - 'PWD': '/builds/slave/test', 14:24:17 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 14:24:17 INFO - 'SHELL': '/bin/bash', 14:24:17 INFO - 'SHLVL': '1', 14:24:17 INFO - 'TERM': 'linux', 14:24:17 INFO - 'TMOUT': '86400', 14:24:17 INFO - 'USER': 'cltbld', 14:24:17 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324', 14:24:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:24:17 INFO - '_': '/tools/buildbot/bin/python'} 14:24:17 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 14:24:17 INFO - mozversion application_buildid: 20160605113024 14:24:17 INFO - mozversion application_changeset: f42a04d822baa22a4741c4fff1aab2054857e398 14:24:17 INFO - mozversion application_display_name: Nightly 14:24:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 14:24:17 INFO - mozversion application_name: Firefox 14:24:17 INFO - mozversion application_remotingname: firefox 14:24:17 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 14:24:17 INFO - mozversion application_vendor: Mozilla 14:24:17 INFO - mozversion application_version: 49.0a1 14:24:17 INFO - mozversion platform_buildid: 20160605113024 14:24:17 INFO - mozversion platform_changeset: f42a04d822baa22a4741c4fff1aab2054857e398 14:24:17 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 14:24:17 INFO - mozversion platform_version: 49.0a1 14:24:17 INFO - using testdate: 1465161857 14:24:17 INFO - actual date: 1465161857 14:24:17 INFO - starting webserver on 'localhost:44482' 14:24:17 INFO - SUITE-START | Running 2 tests 14:24:17 INFO - TEST-START | dromaeo_css 14:24:17 INFO - operating with platform_type : linux_ 14:24:17 INFO - Initialising browser for dromaeo_css test... 14:24:17 INFO - TEST-INFO | started process 25168 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmps9NdIR/profile http://localhost:44482/getInfo.html) 14:24:22 INFO - PROCESS | 25168 | __metrics Screen width/height:1600/1200 14:24:22 INFO - PROCESS | 25168 | colorDepth:24 14:24:22 INFO - PROCESS | 25168 | Browser inner width/height: 1024/697 14:24:22 INFO - PROCESS | 25168 | __metrics 14:24:23 ERROR - PROCESS | 25168 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2938: TypeError: this.tabs is undefined 14:24:24 INFO - TEST-INFO | 25168: exit 0 14:24:24 INFO - Browser initialized. 14:24:24 INFO - Running cycle 1/1 for dromaeo_css test... 14:24:24 INFO - TEST-INFO | started process 25289 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmps9NdIR/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:24:36 INFO - PROCESS | 25289 | RSS: Main: 167063552 14:24:36 INFO - PROCESS | 25289 | 14:25:25 INFO - PROCESS | 25289 | 1465161925723 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] 14:27:32 INFO - PROCESS | 25289 | Cycle 1(1): loaded http://localhost:44482/tests/dromaeo/cssquery-dojo.html (next: http://localhost:44482/tests/dromaeo/cssquery-ext.html) 14:27:33 INFO - PROCESS | 25289 | RSS: Main: 169451520 14:27:33 INFO - PROCESS | 25289 | 14:30:36 INFO - PROCESS | 25289 | Cycle 1(1): loaded http://localhost:44482/tests/dromaeo/cssquery-ext.html (next: http://localhost:44482/tests/dromaeo/cssquery-jquery.html) 14:30:36 INFO - PROCESS | 25289 | RSS: Main: 169295872 14:30:36 INFO - PROCESS | 25289 | 14:33:38 INFO - PROCESS | 25289 | Cycle 1(1): loaded http://localhost:44482/tests/dromaeo/cssquery-jquery.html (next: http://localhost:44482/tests/dromaeo/cssquery-mootools.html) 14:33:39 INFO - PROCESS | 25289 | RSS: Main: 171220992 14:33:39 INFO - PROCESS | 25289 | 14:36:40 INFO - PROCESS | 25289 | Cycle 1(1): loaded http://localhost:44482/tests/dromaeo/cssquery-mootools.html (next: http://localhost:44482/tests/dromaeo/cssquery-prototype.html) 14:36:41 INFO - PROCESS | 25289 | RSS: Main: 168189952 14:36:41 INFO - PROCESS | 25289 | 14:39:44 INFO - PROCESS | 25289 | Cycle 1(1): loaded http://localhost:44482/tests/dromaeo/cssquery-prototype.html (next: http://localhost:44482/tests/dromaeo/cssquery-yui.html) 14:39:44 INFO - PROCESS | 25289 | RSS: Main: 170430464 14:39:44 INFO - PROCESS | 25289 | 14:42:47 INFO - PROCESS | 25289 | Cycle 1(1): loaded http://localhost:44482/tests/dromaeo/cssquery-yui.html (next: http://localhost:44482/tests/dromaeo/cssquery-dojo.html) 14:42:47 INFO - PROCESS | 25289 | RSS: Main: 171753472 14:42:47 INFO - PROCESS | 25289 | 14:42:47 INFO - PROCESS | 25289 | __start_tp_report 14:42:47 INFO - PROCESS | 25289 | _x_x_mozilla_page_load 14:42:47 INFO - PROCESS | 25289 | _x_x_mozilla_page_load_details 14:42:47 INFO - PROCESS | 25289 | |i|pagename|runs| 14:42:47 INFO - PROCESS | 25289 | |0;dojo.html;3070.8311042892637;3113.859876305566;3148.039847846406;3150.1494596458956;3155.3058327168014;5333.093374126393;5361.061814182517;5407.513323800862;5420.891582168354;5431.538319242869;5286.603504737151;5402.081646120159;5456.345238571367;5504.119340905456;5527.640703354279;4920.188168952128;4960.875978100558;5054.1407960646775;5098.362704661918;5151.098557752397;688.8565498238435;4794.544518270776;4916.950830491685;4934.333864928225;5075.796968121271;4872.975635121819;4926.11329960607;4930.433000204968;4934.580560652349;4954.9594585137165;4985.651004429691;4990.725510096943;5005.74971251436;5006.5494105530315;5020.196768517057;4924.039812236615;4934.580560652349;4995.075910956485;4996.900061998776;5006.048850718352;5399.865003374908;5437.483439073281;5444.863878403032;5454.645448045864;5456.208849716809;5664.603477756558;5802.709864506758;5835.649861008353;5856.648601083906;5857.4435428634215;5897.14491398749;5922.792702255443;5936.406359364072;5941.049432090888;6005.729742161613;5498.3127109111365;5523.917141242885;5528.9723551382385;5531.004419204542;5535.501804837584;5843.415658434123;5966.105084237399;6025.427584379477;6037.245344331958;6051.485623721945;5818.301803783573;5829.62107463022;5844.503217226584;5860.736266868002;5877.617954832922;5905.527557795366;5908.911366329508;5913.822585322448;5914.970425147847;5928.258967629046;5610.579206559442;5752.338481074647;5795.507381872504;5824.009918313896;5899.675517846474;5751.511121554631;5835;5836.941630583725;5837.3870743571315;5847.853803654943;4436.578525040116;4461.08547747711;4462.085272519126;4480.350349199348;4484.484284307281;3845.615438456132;3897.4543563901075;3936.4292177634084;3968.543617483969;3994.840206391712;5601.831945041656;5649.971750141223;5653.265075540154;5681.9431805681415;5693.4875861172695;5896;5961.672108034013;5967.104934259895;5969.761209551656;5978.983572792636;5411.2965314508865;5488.231647569343;5535.806246781424;5551.583631227674;5642.210090587239;5062.493750624908;5069.290299358093;5080.49195080489;5087.033463641897;5097.847064588068;5961.195238642815;6136.8772624548155;6143.723532441051;6147.170132032118;6149.477294430024;5856.677882716492;5910.379410161871;5922.970385147961;5960.195373624679;5966.313873904556;6127.111568822585;6149.169862068742;6156.876862462816;6162.753489860355;6166.784162554289;5596.496315331639;5646.717664116695;5807.535397168301;5809.157672137601;5811.970940145441;5715.085586306337;5820.76716931318;5821.301443826768;5833.300003999378;5884.0585506318785;5651.265335506522;5697.943020569907;5706.3152421709665;5706.372299047019;5713.371529131875;5491.121420572689;5647.943520564741;5677.375488696158;5679.346875109415;5694.202811606461;5599.496045355938;5629.268195134607;5676.4323567642905;5681.204631351697;5716.5998380113;5770.365259821332;5800.332961709458;5803.071508558611;5811;5811.883762324815;5423.891522169613;5608.186812912187;5638.097904335286;5655.095184770582;5702.7718891243885 14:42:47 INFO - PROCESS | 25289 | |1;ext.html;571.2488078177199;617.4597227426002;617.8640699046211;637.4836382530151;641.8427485266111;38808;42994.570054299445;42996.14007719848;43044.354334685006;43098;43887.34168987468;44651;44718.32922506165;44746.32880506795;44751;8676.869846952284;8759.824803503927;8854.07032261613;8860.29117670588;8860.556972151398;8747.212750852423;8810.471371717718;8826.161514656098;8846.911530884674;8847.73456796297;8821.073787252342;8863.512506812154;8899.911000890006;8932.240759535447;8932.866007009867;8823.808785813897;8870.911290887105;8877.112288771103;8881.511516866569;8887.73336799897;8701.521416322099;8731.301495880314;8790.912090879137;8827.691030813954;8827.911720882837;41321.79339103285;41719.374209386886;41744.79127604373;41781.03080207376;41803.954901127414;3525.4888041234135;3615.963840361589;3625.401808701561;3758.5113935188524;4014.080650059982;33190.33619327624;33347;33361.16597085068;33629.15927101817;33646.33715930383;4365.279728844736;4370.344448332776;4576;4616.469106052779;4649.093426781779;346278;350514;351297;351497;352076;34197.48703769445;35214.471782923276;59658.70170649119;59931;60126;35537.1115722109;35564.64435355665;35600.64399355973;35760;35762.642373576455;14980.400783968737;14986;15077.869159813057;15078.849211507964;15089.47186848455;12131.878681213075;12264.754704905852;12329.93835030837;12330.938345308396;12387.814182787266;8410.453320534145;8432.114627964098;8470.237678608832;8540.701075462453;8574;3232.402005628966;3262.5432439458496;3273.492608645664;3323.3519463704347;3365.865365385357;1027.5684212630713;1057.9843350383717;1062;1176.4235524592889;1199.646104399187;33429.83285083559;33579.496307555404;33784.831075844464;33815.154621134665;34093.48859767106;1127.7237076916044;1131.1742428027421;1160.611195249584;1201.4893670190133;1263.3178083834625;17255.827441725673;17495.825041749675;17802.91098544499;17833.375831845824;17839.910800446174;567553;573944;574600;580814.3429959862;586334;58631;59261.40738592559;59328;59354;59743.402565974655;1340.2092765268537;1372.0464277327162;1389.485890220625;1396.2809153286066;1406.7045920356636;31377;32819;33120.1719957003;33131.50302745509;33580.496292555144;51705.48294517157;51831;52399.73800130975;52492.737536312074;52557.737211313695;470421;472284;472558;472966;473314;26682.19953401401;26747;27036.1889143326;28433.715662843108;28458.85770571134;48394.50340922019;49166.26250606172;49218.507814921395;49976.50023499864;50250.497495026044;41436.792816036934;41478.792606036775;41527.792361038;41531.1693766129;42961.3555796657;40442.39336409897;41060.384094239205;41789.791051045766;41838.37242441305;42538;41821.372679410444;42109;42963.06666200091;45276;45958.310625339975;37698.62301377061;37802.243955121296;38070.61929380782;38890.416643750934;38995.805020974716;28344.14967550977;28822.279443014093;29020.419591608472;29083.854580727806;29111.12666620005 14:42:47 INFO - PROCESS | 25289 | |2;jquery.html;384.2775581906016;389.2468074276276;389.29343242015756;398.53769627232407;415.0909508177092;17789.37737179199;18782.53043673909;19224.61550768984;19230.711539326905;19868.60262794743;18277.177527011285;18526.907365463187;18953.33663321784;18998.14508347124;19271.61456770867;5538.889222215554;5647.463490968372;5798;5813.593048486608;5834.358220595752;5692.8861422771515;5721.5708821838525;5740.196372507852;5761.078227483604;5769.480746732793;5541.224228607998;5698.829035128932;5718.056520674084;5727.055035919068;5744.3394009689;5644.153376993443;5676.858078548028;5684.9147262790675;5688.658680479184;5694.857628559278;4954.950450495485;5122.820701275475;5129.487051294878;5138.460461651547;5167.844964651066;16769.496915092568;16784;16799.66400671992;21594.460138496506;21836.017379217974;2079.376187143851;2561.859097749623;2623.4490756941063;2904.7385735283924;2905.8692358843905;10479.109275711573;10637.9468102659;11514.827277590843;13041.282729449877;14755.926220368936;1987.7217189593468;2041.5202427429542;2054.2707338894625;2057.094878253564;2079.07481170879;78659;79549.60225198837;80409;80480.19519804786;81693.59153204256;10660.946695266473;10714.589217426017;10793.67618971432;10935.28920620157;11068.335899846035;15091.54725358241;15126.092434453967;15286.38854445832;15293.694126117416;15345.539633811004;7886.329661978796;7960.363170946426;7977.680892764224;8104.311133553596;8153.266206041485;7672.271134242238;7676.155622881479;7774.06711194649;7830.491018083806;7864.842703145905;4642.489326174118;4645.187092258909;4718.4809670936165;4750.144973904661;4795.352627395327;1894.6400183965002;1952.5801952580264;1977.406777966633;1991.412533302679;1998.5403357227628;889.7908991387019;958.712386284112;1018.2464975917768;1043.3009883378154;1043.8434234864678;18755.437336879917;19044.333448329242;19142.330018449287;19308.32420865291;19514.60970780605;945.5744914788236;964.81668482988;985.5909797434128;1016.9694909152737;1052.8789189243182;10298.07317341428;10743.570257189782;10803.297785643908;10860.45697715111;10891.400972946563;458392;459723;464389;467615;469821;90786;92886.39964920389;94200.52899735457;95522;103582.48208758907;1040.547361897577;1050.9054185123375;1056.1339701444895;1074.8065348237235;1086.5925278020743;17447.651046979245;17940.461786146436;17950.91024544869;18013.2794688211;18273.3604323848;38066.429003564415;39843.402348964206;40572;40944.385834213106;41595.58404416038;58398;59292.703536483765;59395;59804.40195597988;61241;8236.50580965144;8390.077091519806;8462.83074338522;8533.317334613092;8714.520701361485;9540.045995400404;12482.812757808822;12557.434915428645;13104.868951310746;13552.728945421233;11820.70448238801;11954.58158964432;11993.160478766402;12057.939710301744;12079.51681932713;11695.649130526097;11846.822297665714;11911.463984120563;11946;12054.75890482168;12009.819852702041;12118.333491658044;12152.817707734213;12230.816537751763;12348.814767778671;7174.605396703231;7578.12851522082;7899.368050556057;8043.959780201061;8891.955540222258;11340.149488788209;12095.334756588472;12129.454174562343;12140.635780926234;12161.087918406332 14:42:47 INFO - PROCESS | 25289 | |3;mootools.html;1485.7548504496756;1535.7619568966809;1657.4447560067376;1788.7942886568048;1803.9909800450996;7786.377089832814;8620.698275560357;8814.735557933256;9275.443473391593;9294.721158365242;8826.382153249275;9092.8636070459;9101.499417532033;9108.134727200922;9132.54337283135;2332.7200735911715;2393.078664714089;2398.292503711409;2404.158544509425;2406.5547873643345;2321.767823217673;2347.530493901218;2390.3904504351367;2394.042383046778;2405.8315917885757;2362.137819695816;2380.5595964746576;2385.7614238576175;2407.518496300738;2419.0565679385054;2307.3885420363617;2332.2769941318074;2340.2979106268053;2357.163207061503;2357.705286839145;2291.954160916789;2304.9654255186188;2306.1467257114973;2321.6981792367055;2339.6256598944087;8974.28205743539;9003.639854405816;9081.409708369001;9117.954410227972;9120.315976301805;5190.273361729361;5326.680399176062;5400.810971615974;5429.239906413066;5454.4545545445535;3379.8817041403677;3396.473546600256;3490.703290220334;3500.072480792592;3506.5792104947313;1095.901368876797;1106.4080716816466;1143.822707480342;1181.1318680769627;1185.3006726031597;12582.937085314516;12603.117781755282;12623.684407889785;12651.493940242379;12662.873371266262;4607.101615185007;4629.120467111238;4743.169945259635;4755.239161734106;4792.161371759928;10639;10639.414832184304;10657.626983055556;10714.73213169677;10729.141668666489;5420.539254163361;5426.186072089218;5428.782848686008;5442.455754424526;5468.535174510212;4180.226658068206;4599.241125214369;4692.694974826625;4826.0347930414055;4841.346418233564;4003.799810009488;4069.7354671946227;4090.5909409058854;4123.072308730511;4153.833846646161;1271.879171478708;1277.9105462617713;1279.05350040969;1280.5390059578544;1283.1723538317733;805.162630863895;900.2707806676613;936.878205833251;964.2816102004052;995.1541189988596;5863.648181109147;6012.488938440281;6082.787102451482;6103.023516237469;6104.084387341845;1036.4558606731525;1060.9363438193734;1078.009401590737;1091.6015654286286;1105.5190991918541;3926.3325234709596;4082.1631565528996;4099.836006559704;4140.937885931713;4152.5432202457705;11123.610673626385;11273.661790146145;11430.714232144262;11443.771124577628;11517.48171332292;11176.776464470828;11232.719182020352;11305.660830175108;11350.375729334966;11384.260023098472;8426.368022398345;8575;8578.828423431622;8599.226069653761;8755.912440875638;5880;6018.4583387493585;6040.09398590215;6057.757689692363;6087.239095113111;10225.84661230097;10624.734381640521;10718.73203169927;10743.623973160902;10765.407902565434;10518.158547316349;10679.87861274555;10756.247062705535;10930.289531180448;10941.617043403761;6523.7716679915975;7456.51532650376;7565;7612.96193519051;7664.961675191588;8933.776655583662;8938.4190027648;8973.596188171417;8989.595468203815;8999.245147196234;7484.363829074589;7720.034995625547;7822.608869556613;7867.409944254089;7888.329491993245;7772.68909243624;7991.400644951768;7995.440319177602;8033.397495187767;8035.397345199017;7231.4214862809795;7246.746363877239;7358.889616655647;7366.558006519626;7397.297256760599;5128.8461346159675;5221.477852214748;5252.107141785829;5314.707691076873;5320.707361095022;5262.526372626482;5266.131088370529;5301.893962120659;5427.0231358354295;5438.102713052302 14:42:47 INFO - PROCESS | 25289 | |4;prototype.html;323.87530800641747;335.06349752441923;339.1758027991979;339.51618943006224;341.73515525467747;5390.595705322097;5499.807506737265;5556.888862222758;5647.6893770842635;5657.660540367576;5435.673859568428;5600.1599760036015;5616.550675945925;5625.606207565472;5647.661140331583;4269.502341130443;4291.463567054118;4293.763842988635;4307.719998200107;4319.524852266248;4082.7547597982602;4279.465066866642;4287.5069367022725;4338.869833904988;4342.652587792969;4236.368997935786;4240.851570195044;4247.25673007224;4265.274903266452;4269.338252570857;4255.191543593975;4262.190183865056;4292.334688123346;4295.334223195409;4301.698881078326;3554.5201397811225;3766.114962983697;3788.3749181385315;3807.904802379935;3812.80935953204;5290.444503327134;5293.550048245904;5384.1923711443205;5389.197617239053;5397.54120899724;4822.132016237076;4833.879153021167;4854.320395144682;4862.878428039292;4890.413150421937;5584.4136365681425;5746.683932383718;5781.942180578182;5798.565107616945;5814.534837213013;4074.694397920168;4088.7546747195265;4107.486564179478;4112.9717570607345;4123.731957422758;6062.848428789272;6095.756169753205;6101.206843110367;6111.755529778803;6121.66330851803;3966.631512128311;4175.457190565207;4188.4136220929095;4195.832166713297;4213.831446742096;4282.314829627245;4287.335463003239;4289.420928174719;4291.892702682396;4302.397664326997;4857.101436234308;4905.681130726492;4933.481984391659;4961.776720047606;4977.153883839684;5330.307060082165;5842.211301474246;5868.794592189253;5884.911726324109;5913.793017244462;1458.8905832062426;1463.978040329396;1475.42458441208;1479.52655150353;1485.5543336998858;921.8067022826615;932.5710173320349;937.840567103594;944.2964991081689;945.333539854401;5090.949090509122;5091.439941606421;5151.639385242997;5168.449465160436;5174.870628234325;5336.706481143575;5396.892062158813;5399.244105825188;5408.540274076748;5409.648372855751;5057.6459647824295;5134.383873935151;5157.535821776059;5477.561795056386;5870.060790273621;3229.709326160657;3240.465323221642;3242.643309235982;3255.316383559432;3256.820874851906;6000.268668746351;6192.828987795241;6238.906416403757;6330.746770129235;6340.239171299474;6123;6135.693215339215;6153.630782153085;6205.162303089115;6231.9688401557705;6231.102537320168;6252.562320637512;6353.682315884187;6359.300476947532;6408.359164083555;5762.971185144047;6039.909401358896;6041.365656605993;6058.636481811105;6072.8785424292155;5949.613275137102;6026.156338112755;6064.4541991221;6100.603460775035;6120.357362476876;6059.787907423395;6261.966775482177;6265.74937002533;6375.6174629522375;6400.935990640034;4194.601512856274;4204.558521355214;4218.367244913287;4222.176675548361;4224.767637779952;5754.136879467946;5951.672658003851;6087.482563982111;6091.634501929899;6111.786087486917;5857.410413285054;5879.2944846618675;5891.23413956183;5909.3795151508475;5924.763009479572;5824.301083869963;5832.445917637818;5832.737526811219;5867.20792692981;5870.853228669317;5480.068388373907;5741.5119714824705;5765.394633563583;5767.3367562729145;5786;5881.73532191061;5906.320773110975;5922.437368449991;5938.435848594377;5967.254093238345;5503.944960550343;5797.6521408713925;5807.8548036299435;5838.182654428469;5849.912251316318 14:42:47 INFO - PROCESS | 25289 | |5;yui.html;755.9508631938927;767.1484652036239;810.461043406135;821.7822277096568;848.7581039403769;14634.268286585668;14647.316571679534;14762.926185369084;14806.555803325904;14830.48093316734;13603.251821149834;13891.861081389183;13915.956303277244;14014.299285035759;14028.579142625738;798.9081255655601;811.5698679699768;813.4102775487784;815.3925325632412;816.7549735079482;799.7800604833689;814.7433558429076;831.8419500294955;836.4103307168432;838.0362583029504;861.4788053227801;865.2991077227466;865.5974971638187;866.5883705239992;871.8692196170562;863.9654413823471;866.4627930682954;867.5922316511229;867.8351113288455;869.9304055675531;623.4295619508144;626.4174317884366;629.7481007596953;630.1304200203735;631.2897989761518;14821.925890370587;14843.10941343512;14853.331600078023;14964.02733822309;14985.625359365995;14186.148831070168;14338.211398373085;14394.280285985764;14449.566513004627;14647.487337943121;12035.780167762967;12044.81932771009;12192.81710774339;12281.938590307082;12778.488860445572;3920.137569734654;3922.882313530599;3967.4048892666333;4068.698016634678;4073.06319546506;75943;77649.83525247125;78027.60986195033;78609.60695196487;78829;11782.205894097997;11840.467178976967;11848.348340841336;11861.288322700666;12173.634790956285;21862.23482178148;21918.23286184976;21941.122355105617;21948.670769938464;22023;8056.234657707509;8061.355091592659;8197.508149511048;8239.052508961546;8356.958215208884;4751.6436267279405;4792.353032340659;4960.255961605716;4965.4041515018425;5029.547340739351;3655.3054919565197;3797.9050523736573;3802.429635554689;3809.466674665549;3818.198178382571;615.8829822333743;620.0915658560231;621.0683974038942;632.6330728177646;641.1408712325506;603.9818805435845;696.7979286007002;711.4095300900241;738.3391864281546;752.9134149572869;9948.303618746762;10545.31455455393;10737.302075365076;10738.409387483764;10840.186985975926;725.2424097917677;746.8879668049727;755.7468248136936;769.7036640893184;795.8766391209372;4902.509749025069;4916.459189489154;5027.874303142451;5039.21892106724;5046.243063540425;71193;72110.63944680244;72146.63926680334;113920.88632909347;113926.43036784763;91916.54041729748;94485;95869;96186;99647.50176249217;83382.58308708538;87448.5627571858;87712.5614371924;89415.55292223497;89654.55172724095;9596.712098637052;9698.36960597559;9799.804003920024;9814.607415703293;9854.21166306708;49550.50449495459;50583.241251381995;50885.236721449946;51067;51884.48115518797;66407.33592664011;70098.64950675418;72184.63907680428;74732.25267747471;75233.24766752482;11346.092312615136;11497.310161390344;11626.069914406658;11721;11835.82246266324;14302.642433938818;15145.242737863284;15489.922550387177;15636.530904072895;15756.369745210062;13099.738005240033;13657.590272291847;15098.320575574346;15107.848921510644;15385.610251104248;14164.220967846868;14602.601550218094;14638.780418293947;14664.70670586561;14828.110313381232;11236.494357754083;13136.73726525445;13567.660808479472;14029.719405612035;14140.717185656435;11087.279326843729;11223.214374993671;11242;11689.298642081503;11758;11395.35925238467;11665.59170429031;12015.339156346135;12254.38728063611;12316.445759941003 14:42:47 INFO - PROCESS | 25289 | __end_tp_report 14:42:47 INFO - PROCESS | 25289 | __start_cc_report 14:42:47 INFO - PROCESS | 25289 | _x_x_mozilla_cycle_collect,347 14:42:47 INFO - PROCESS | 25289 | __end_cc_report 14:42:47 INFO - PROCESS | 25289 | __startTimestamp1465162967754__endTimestamp 14:42:47 INFO - PROCESS | 25289 | 14:42:47 INFO - PROCESS | 25289 | ------- Summary: start ------- 14:42:47 INFO - PROCESS | 25289 | Number of tests: 6 14:42:47 INFO - PROCESS | 25289 | 14:42:47 INFO - PROCESS | 25289 | [#0] dojo.html Cycles:165 Average:5416.98 Median:5653.27 stddev:735.35 (13.0%) stddev-sans-first:714.20 14:42:47 INFO - PROCESS | 25289 | Values: 3070.8 3113.9 3148.0 3150.1 3155.3 5333.1 5361.1 5407.5 5420.9 5431.5 5286.6 5402.1 5456.3 5504.1 5527.6 4920.2 4960.9 5054.1 5098.4 5151.1 688.9 4794.5 4917.0 4934.3 5075.8 4873.0 4926.1 4930.4 4934.6 4955.0 4985.7 4990.7 5005.7 5006.5 5020.2 4924.0 4934.6 4995.1 4996.9 5006.0 5399.9 5437.5 5444.9 5454.6 5456.2 5664.6 5802.7 5835.6 5856.6 5857.4 5897.1 5922.8 5936.4 5941.0 6005.7 5498.3 5523.9 5529.0 5531.0 5535.5 5843.4 5966.1 6025.4 6037.2 6051.5 5818.3 5829.6 5844.5 5860.7 5877.6 5905.5 5908.9 5913.8 5915.0 5928.3 5610.6 5752.3 5795.5 5824.0 5899.7 5751.5 5835.0 5836.9 5837.4 5847.9 4436.6 4461.1 4462.1 4480.4 4484.5 3845.6 3897.5 3936.4 3968.5 3994.8 5601.8 5650.0 5653.3 5681.9 5693.5 5896.0 5961.7 5967.1 5969.8 5979.0 5411.3 5488.2 5535.8 5551.6 5642.2 5062.5 5069.3 5080.5 5087.0 5097.8 5961.2 6136.9 6143.7 6147.2 6149.5 5856.7 5910.4 5923.0 5960.2 5966.3 6127.1 6149.2 6156.9 6162.8 6166.8 5596.5 5646.7 5807.5 5809.2 5812.0 5715.1 5820.8 5821.3 5833.3 5884.1 5651.3 5697.9 5706.3 5706.4 5713.4 5491.1 5647.9 5677.4 5679.3 5694.2 5599.5 5629.3 5676.4 5681.2 5716.6 5770.4 5800.3 5803.1 5811.0 5811.9 5423.9 5608.2 5638.1 5655.1 5702.8 14:42:47 INFO - PROCESS | 25289 | 14:42:47 INFO - PROCESS | 25289 | [#1] ext.html Cycles:180 Average:61361.45 Median:41732.08 stddev:126610.98 (303.4%) stddev-sans-first:126883.89 14:42:47 INFO - PROCESS | 25289 | Values: 571.2 617.5 617.9 637.5 641.8 38808.0 42994.6 42996.1 43044.4 43098.0 43887.3 44651.0 44718.3 44746.3 44751.0 8676.9 8759.8 8854.1 8860.3 8860.6 8747.2 8810.5 8826.2 8846.9 8847.7 8821.1 8863.5 8899.9 8932.2 8932.9 8823.8 8870.9 8877.1 8881.5 8887.7 8701.5 8731.3 8790.9 8827.7 8827.9 41321.8 41719.4 41744.8 41781.0 41804.0 3525.5 3616.0 3625.4 3758.5 4014.1 33190.3 33347.0 33361.2 33629.2 33646.3 4365.3 4370.3 4576.0 4616.5 4649.1 346278.0 350514.0 351297.0 351497.0 352076.0 34197.5 35214.5 59658.7 59931.0 60126.0 35537.1 35564.6 35600.6 35760.0 35762.6 14980.4 14986.0 15077.9 15078.8 15089.5 12131.9 12264.8 12329.9 12330.9 12387.8 8410.5 8432.1 8470.2 8540.7 8574.0 3232.4 3262.5 3273.5 3323.4 3365.9 1027.6 1058.0 1062.0 1176.4 1199.6 33429.8 33579.5 33784.8 33815.2 34093.5 1127.7 1131.2 1160.6 1201.5 1263.3 17255.8 17495.8 17802.9 17833.4 17839.9 567553.0 573944.0 574600.0 580814.3 586334.0 58631.0 59261.4 59328.0 59354.0 59743.4 1340.2 1372.0 1389.5 1396.3 1406.7 31377.0 32819.0 33120.2 33131.5 33580.5 51705.5 51831.0 52399.7 52492.7 52557.7 470421.0 472284.0 472558.0 472966.0 473314.0 26682.2 26747.0 27036.2 28433.7 28458.9 48394.5 49166.3 49218.5 49976.5 50250.5 41436.8 41478.8 41527.8 41531.2 42961.4 40442.4 41060.4 41789.8 41838.4 42538.0 41821.4 42109.0 42963.1 45276.0 45958.3 37698.6 37802.2 38070.6 38890.4 38995.8 28344.1 28822.3 29020.4 29083.9 29111.1 14:42:47 INFO - PROCESS | 25289 | 14:42:47 INFO - PROCESS | 25289 | [#2] jquery.html Cycles:180 Average:28249.82 Median:12198.94 stddev:76744.55 (629.1%) stddev-sans-first:76931.32 14:42:47 INFO - PROCESS | 25289 | Values: 384.3 389.2 389.3 398.5 415.1 17789.4 18782.5 19224.6 19230.7 19868.6 18277.2 18526.9 18953.3 18998.1 19271.6 5538.9 5647.5 5798.0 5813.6 5834.4 5692.9 5721.6 5740.2 5761.1 5769.5 5541.2 5698.8 5718.1 5727.1 5744.3 5644.2 5676.9 5684.9 5688.7 5694.9 4955.0 5122.8 5129.5 5138.5 5167.8 16769.5 16784.0 16799.7 21594.5 21836.0 2079.4 2561.9 2623.4 2904.7 2905.9 10479.1 10637.9 11514.8 13041.3 14755.9 1987.7 2041.5 2054.3 2057.1 2079.1 78659.0 79549.6 80409.0 80480.2 81693.6 10660.9 10714.6 10793.7 10935.3 11068.3 15091.5 15126.1 15286.4 15293.7 15345.5 7886.3 7960.4 7977.7 8104.3 8153.3 7672.3 7676.2 7774.1 7830.5 7864.8 4642.5 4645.2 4718.5 4750.1 4795.4 1894.6 1952.6 1977.4 1991.4 1998.5 889.8 958.7 1018.2 1043.3 1043.8 18755.4 19044.3 19142.3 19308.3 19514.6 945.6 964.8 985.6 1017.0 1052.9 10298.1 10743.6 10803.3 10860.5 10891.4 458392.0 459723.0 464389.0 467615.0 469821.0 90786.0 92886.4 94200.5 95522.0 103582.5 1040.5 1050.9 1056.1 1074.8 1086.6 17447.7 17940.5 17950.9 18013.3 18273.4 38066.4 39843.4 40572.0 40944.4 41595.6 58398.0 59292.7 59395.0 59804.4 61241.0 8236.5 8390.1 8462.8 8533.3 8714.5 9540.0 12482.8 12557.4 13104.9 13552.7 11820.7 11954.6 11993.2 12057.9 12079.5 11695.6 11846.8 11911.5 11946.0 12054.8 12009.8 12118.3 12152.8 12230.8 12348.8 7174.6 7578.1 7899.4 8044.0 8892.0 11340.1 12095.3 12129.5 12140.6 12161.1 14:42:47 INFO - PROCESS | 25289 | 14:42:47 INFO - PROCESS | 25289 | [#3] mootools.html Cycles:180 Average:5956.21 Median:4389.73 stddev:3423.89 (78.0%) stddev-sans-first:3417.01 14:42:47 INFO - PROCESS | 25289 | Values: 1485.8 1535.8 1657.4 1788.8 1804.0 7786.4 8620.7 8814.7 9275.4 9294.7 8826.4 9092.9 9101.5 9108.1 9132.5 2332.7 2393.1 2398.3 2404.2 2406.6 2321.8 2347.5 2390.4 2394.0 2405.8 2362.1 2380.6 2385.8 2407.5 2419.1 2307.4 2332.3 2340.3 2357.2 2357.7 2292.0 2305.0 2306.1 2321.7 2339.6 8974.3 9003.6 9081.4 9118.0 9120.3 5190.3 5326.7 5400.8 5429.2 5454.5 3379.9 3396.5 3490.7 3500.1 3506.6 1095.9 1106.4 1143.8 1181.1 1185.3 12582.9 12603.1 12623.7 12651.5 12662.9 4607.1 4629.1 4743.2 4755.2 4792.2 10639.0 10639.4 10657.6 10714.7 10729.1 5420.5 5426.2 5428.8 5442.5 5468.5 4180.2 4599.2 4692.7 4826.0 4841.3 4003.8 4069.7 4090.6 4123.1 4153.8 1271.9 1277.9 1279.1 1280.5 1283.2 805.2 900.3 936.9 964.3 995.2 5863.6 6012.5 6082.8 6103.0 6104.1 1036.5 1060.9 1078.0 1091.6 1105.5 3926.3 4082.2 4099.8 4140.9 4152.5 11123.6 11273.7 11430.7 11443.8 11517.5 11176.8 11232.7 11305.7 11350.4 11384.3 8426.4 8575.0 8578.8 8599.2 8755.9 5880.0 6018.5 6040.1 6057.8 6087.2 10225.8 10624.7 10718.7 10743.6 10765.4 10518.2 10679.9 10756.2 10930.3 10941.6 6523.8 7456.5 7565.0 7613.0 7665.0 8933.8 8938.4 8973.6 8989.6 8999.2 7484.4 7720.0 7822.6 7867.4 7888.3 7772.7 7991.4 7995.4 8033.4 8035.4 7231.4 7246.7 7358.9 7366.6 7397.3 5128.8 5221.5 5252.1 5314.7 5320.7 5262.5 5266.1 5301.9 5427.0 5438.1 14:42:47 INFO - PROCESS | 25289 | 14:42:47 INFO - PROCESS | 25289 | [#4] prototype.html Cycles:180 Average:4874.67 Median:5456.62 stddev:1457.58 (26.7%) stddev-sans-first:1421.08 14:42:47 INFO - PROCESS | 25289 | Values: 323.9 335.1 339.2 339.5 341.7 5390.6 5499.8 5556.9 5647.7 5657.7 5435.7 5600.2 5616.6 5625.6 5647.7 4269.5 4291.5 4293.8 4307.7 4319.5 4082.8 4279.5 4287.5 4338.9 4342.7 4236.4 4240.9 4247.3 4265.3 4269.3 4255.2 4262.2 4292.3 4295.3 4301.7 3554.5 3766.1 3788.4 3807.9 3812.8 5290.4 5293.6 5384.2 5389.2 5397.5 4822.1 4833.9 4854.3 4862.9 4890.4 5584.4 5746.7 5781.9 5798.6 5814.5 4074.7 4088.8 4107.5 4113.0 4123.7 6062.8 6095.8 6101.2 6111.8 6121.7 3966.6 4175.5 4188.4 4195.8 4213.8 4282.3 4287.3 4289.4 4291.9 4302.4 4857.1 4905.7 4933.5 4961.8 4977.2 5330.3 5842.2 5868.8 5884.9 5913.8 1458.9 1464.0 1475.4 1479.5 1485.6 921.8 932.6 937.8 944.3 945.3 5090.9 5091.4 5151.6 5168.4 5174.9 5336.7 5396.9 5399.2 5408.5 5409.6 5057.6 5134.4 5157.5 5477.6 5870.1 3229.7 3240.5 3242.6 3255.3 3256.8 6000.3 6192.8 6238.9 6330.7 6340.2 6123.0 6135.7 6153.6 6205.2 6232.0 6231.1 6252.6 6353.7 6359.3 6408.4 5763.0 6039.9 6041.4 6058.6 6072.9 5949.6 6026.2 6064.5 6100.6 6120.4 6059.8 6262.0 6265.7 6375.6 6400.9 4194.6 4204.6 4218.4 4222.2 4224.8 5754.1 5951.7 6087.5 6091.6 6111.8 5857.4 5879.3 5891.2 5909.4 5924.8 5824.3 5832.4 5832.7 5867.2 5870.9 5480.1 5741.5 5765.4 5767.3 5786.0 5881.7 5906.3 5922.4 5938.4 5967.3 5503.9 5797.7 5807.9 5838.2 5849.9 14:42:47 INFO - PROCESS | 25289 | 14:42:47 INFO - PROCESS | 25289 | [#5] yui.html Cycles:180 Average:20046.58 Median:27255.38 stddev:27784.36 (101.9%) stddev-sans-first:27824.55 14:42:47 INFO - PROCESS | 25289 | Values: 756.0 767.1 810.5 821.8 848.8 14634.3 14647.3 14762.9 14806.6 14830.5 13603.3 13891.9 13916.0 14014.3 14028.6 798.9 811.6 813.4 815.4 816.8 799.8 814.7 831.8 836.4 838.0 861.5 865.3 865.6 866.6 871.9 864.0 866.5 867.6 867.8 869.9 623.4 626.4 629.7 630.1 631.3 14821.9 14843.1 14853.3 14964.0 14985.6 14186.1 14338.2 14394.3 14449.6 14647.5 12035.8 12044.8 12192.8 12281.9 12778.5 3920.1 3922.9 3967.4 4068.7 4073.1 75943.0 77649.8 78027.6 78609.6 78829.0 11782.2 11840.5 11848.3 11861.3 12173.6 21862.2 21918.2 21941.1 21948.7 22023.0 8056.2 8061.4 8197.5 8239.1 8357.0 4751.6 4792.4 4960.3 4965.4 5029.5 3655.3 3797.9 3802.4 3809.5 3818.2 615.9 620.1 621.1 632.6 641.1 604.0 696.8 711.4 738.3 752.9 9948.3 10545.3 10737.3 10738.4 10840.2 725.2 746.9 755.7 769.7 795.9 4902.5 4916.5 5027.9 5039.2 5046.2 71193.0 72110.6 72146.6 113920.9 113926.4 91916.5 94485.0 95869.0 96186.0 99647.5 83382.6 87448.6 87712.6 89415.6 89654.6 9596.7 9698.4 9799.8 9814.6 9854.2 49550.5 50583.2 50885.2 51067.0 51884.5 66407.3 70098.6 72184.6 74732.3 75233.2 11346.1 11497.3 11626.1 11721.0 11835.8 14302.6 15145.2 15489.9 15636.5 15756.4 13099.7 13657.6 15098.3 15107.8 15385.6 14164.2 14602.6 14638.8 14664.7 14828.1 11236.5 13136.7 13567.7 14029.7 14140.7 11087.3 11223.2 11242.0 11689.3 11758.0 11395.4 11665.6 12015.3 12254.4 12316.4 14:42:47 INFO - PROCESS | 25289 | -------- Summary: end -------- 14:42:47 INFO - PROCESS | 25289 | 14:42:48 INFO - TEST-INFO | 25289: exit 0 14:42:48 INFO - TEST-OK | dromaeo_css | took 1110629ms 14:42:48 INFO - TEST-START | kraken 14:42:48 INFO - operating with platform_type : linux_ 14:42:48 INFO - Initialising browser for kraken test... 14:42:48 INFO - TEST-INFO | started process 25526 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0kP8dX/profile http://localhost:44482/getInfo.html) 14:42:53 INFO - PROCESS | 25526 | __metrics Screen width/height:1600/1200 14:42:53 INFO - PROCESS | 25526 | colorDepth:24 14:42:53 INFO - PROCESS | 25526 | Browser inner width/height: 1024/697 14:42:53 INFO - PROCESS | 25526 | __metrics 14:42:53 ERROR - PROCESS | 25526 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2938: TypeError: this.tabs is undefined 14:42:54 INFO - TEST-INFO | 25526: exit 0 14:42:54 INFO - Browser initialized. 14:42:54 INFO - Running cycle 1/1 for kraken test... 14:42:54 INFO - TEST-INFO | started process 25646 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0kP8dX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:43:06 INFO - PROCESS | 25646 | RSS: Main: 166940672 14:43:06 INFO - PROCESS | 25646 | 14:43:09 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:44482/tests/kraken/driver.html?testName=audio-beat-detection) 14:43:10 INFO - PROCESS | 25646 | RSS: Main: 172326912 14:43:10 INFO - PROCESS | 25646 | 14:43:12 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:44482/tests/kraken/driver.html?testName=audio-dft) 14:43:13 INFO - PROCESS | 25646 | RSS: Main: 171515904 14:43:13 INFO - PROCESS | 25646 | 14:43:16 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:44482/tests/kraken/driver.html?testName=audio-fft) 14:43:17 INFO - PROCESS | 25646 | RSS: Main: 166580224 14:43:17 INFO - PROCESS | 25646 | 14:43:19 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:44482/tests/kraken/driver.html?testName=audio-oscillator) 14:43:19 INFO - PROCESS | 25646 | RSS: Main: 167178240 14:43:19 INFO - PROCESS | 25646 | 14:43:22 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:44482/tests/kraken/driver.html?testName=imaging-gaussian-blur) 14:43:22 INFO - PROCESS | 25646 | RSS: Main: 167370752 14:43:22 INFO - PROCESS | 25646 | 14:43:25 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:44482/tests/kraken/driver.html?testName=imaging-darkroom) 14:43:26 INFO - PROCESS | 25646 | RSS: Main: 167895040 14:43:26 INFO - PROCESS | 25646 | 14:43:29 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:44482/tests/kraken/driver.html?testName=imaging-desaturate) 14:43:30 INFO - PROCESS | 25646 | RSS: Main: 165531648 14:43:30 INFO - PROCESS | 25646 | 14:43:33 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:44482/tests/kraken/driver.html?testName=json-parse-financial) 14:43:33 INFO - PROCESS | 25646 | RSS: Main: 167243776 14:43:33 INFO - PROCESS | 25646 | 14:43:35 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:44482/tests/kraken/driver.html?testName=json-stringify-tinderbox) 14:43:36 INFO - PROCESS | 25646 | RSS: Main: 167346176 14:43:36 INFO - PROCESS | 25646 | 14:43:37 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:44482/tests/kraken/driver.html?testName=stanford-crypto-aes) 14:43:38 INFO - PROCESS | 25646 | RSS: Main: 167948288 14:43:38 INFO - PROCESS | 25646 | 14:43:40 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:44482/tests/kraken/driver.html?testName=stanford-crypto-ccm) 14:43:41 INFO - PROCESS | 25646 | RSS: Main: 168157184 14:43:41 INFO - PROCESS | 25646 | 14:43:43 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:44482/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 14:43:44 INFO - PROCESS | 25646 | RSS: Main: 168210432 14:43:44 INFO - PROCESS | 25646 | 14:43:47 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:44482/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 14:43:47 INFO - PROCESS | 25646 | RSS: Main: 168144896 14:43:47 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | Cycle 1(1): loaded http://localhost:44482/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:44482/tests/kraken/driver.html?testName=ai-astar) 14:43:49 INFO - PROCESS | 25646 | RSS: Main: 169144320 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | __start_tp_report 14:43:49 INFO - PROCESS | 25646 | _x_x_mozilla_page_load 14:43:49 INFO - PROCESS | 25646 | _x_x_mozilla_page_load_details 14:43:49 INFO - PROCESS | 25646 | |i|pagename|runs| 14:43:49 INFO - PROCESS | 25646 | |0;ai-astar;114;108;111;109;112;114;116;112;117;113 14:43:49 INFO - PROCESS | 25646 | |1;audio-beat-detection;151;132;153;177;133;156;158;128;184;133 14:43:49 INFO - PROCESS | 25646 | |2;audio-dft;165;166;163;164;165;176;163;163;165;163 14:43:49 INFO - PROCESS | 25646 | |3;audio-fft;76;76;75;161;76;75;75;76;168;77 14:43:49 INFO - PROCESS | 25646 | |4;audio-oscillator;86;86;165;86;86;87;149;86;86;159 14:43:49 INFO - PROCESS | 25646 | |5;imaging-gaussian-blur;118;117;117;117;119;117;117;117;117;118 14:43:49 INFO - PROCESS | 25646 | |6;imaging-darkroom;147;147;147;148;147;148;147;147;147;147 14:43:49 INFO - PROCESS | 25646 | |7;imaging-desaturate;97;95;95;96;94;95;96;95;97;96 14:43:49 INFO - PROCESS | 25646 | |8;json-parse-financial;54;53;54;55;53;53;54;56;52;53 14:43:49 INFO - PROCESS | 25646 | |9;json-stringify-tinderbox;61;62;62;62;61;62;62;62;62;61 14:43:49 INFO - PROCESS | 25646 | |10;stanford-crypto-aes;80;81;87;83;79;82;81;87;117;82 14:43:49 INFO - PROCESS | 25646 | |11;stanford-crypto-ccm;139;138;125;133;129;122;135;123;126;125 14:43:49 INFO - PROCESS | 25646 | |12;stanford-crypto-pbkdf2;162;165;169;166;161;161;165;163;162;160 14:43:49 INFO - PROCESS | 25646 | |13;stanford-crypto-sha256-iterative;64;66;70;74;64;64;64;63;63;62 14:43:49 INFO - PROCESS | 25646 | __end_tp_report 14:43:49 INFO - PROCESS | 25646 | __start_cc_report 14:43:49 INFO - PROCESS | 25646 | _x_x_mozilla_cycle_collect,903 14:43:49 INFO - PROCESS | 25646 | __end_cc_report 14:43:49 INFO - PROCESS | 25646 | __startTimestamp1465163029846__endTimestamp 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | ------- Summary: start ------- 14:43:49 INFO - PROCESS | 25646 | Number of tests: 14 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#0] ai-astar Cycles:10 Average:112.60 Median:113.50 stddev:2.84 (2.5%) stddev-sans-first:2.96 14:43:49 INFO - PROCESS | 25646 | Values: 114.0 108.0 111.0 109.0 112.0 114.0 116.0 112.0 117.0 113.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#1] audio-beat-detection Cycles:10 Average:150.50 Median:154.50 stddev:19.37 (12.5%) stddev-sans-first:20.55 14:43:49 INFO - PROCESS | 25646 | Values: 151.0 132.0 153.0 177.0 133.0 156.0 158.0 128.0 184.0 133.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#2] audio-dft Cycles:10 Average:165.30 Median:165.00 stddev:3.92 (2.4%) stddev-sans-first:4.15 14:43:49 INFO - PROCESS | 25646 | Values: 165.0 166.0 163.0 164.0 165.0 176.0 163.0 163.0 165.0 163.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#3] audio-fft Cycles:10 Average:93.50 Median:76.00 stddev:37.46 (49.3%) stddev-sans-first:39.20 14:43:49 INFO - PROCESS | 25646 | Values: 76.0 76.0 75.0 161.0 76.0 75.0 75.0 76.0 168.0 77.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#4] audio-oscillator Cycles:10 Average:107.60 Median:86.00 stddev:34.76 (40.4%) stddev-sans-first:35.98 14:43:49 INFO - PROCESS | 25646 | Values: 86.0 86.0 165.0 86.0 86.0 87.0 149.0 86.0 86.0 159.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#5] imaging-gaussian-blur Cycles:10 Average:117.40 Median:117.00 stddev:0.70 (0.6%) stddev-sans-first:0.71 14:43:49 INFO - PROCESS | 25646 | Values: 118.0 117.0 117.0 117.0 119.0 117.0 117.0 117.0 117.0 118.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#6] imaging-darkroom Cycles:10 Average:147.20 Median:147.00 stddev:0.42 (0.3%) stddev-sans-first:0.44 14:43:49 INFO - PROCESS | 25646 | Values: 147.0 147.0 147.0 148.0 147.0 148.0 147.0 147.0 147.0 147.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#7] imaging-desaturate Cycles:10 Average:95.60 Median:96.00 stddev:0.97 (1.0%) stddev-sans-first:0.88 14:43:49 INFO - PROCESS | 25646 | Values: 97.0 95.0 95.0 96.0 94.0 95.0 96.0 95.0 97.0 96.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#8] json-parse-financial Cycles:10 Average:53.70 Median:54.00 stddev:1.16 (2.1%) stddev-sans-first:1.22 14:43:49 INFO - PROCESS | 25646 | Values: 54.0 53.0 54.0 55.0 53.0 53.0 54.0 56.0 52.0 53.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#9] json-stringify-tinderbox Cycles:10 Average:61.70 Median:62.00 stddev:0.48 (0.8%) stddev-sans-first:0.44 14:43:49 INFO - PROCESS | 25646 | Values: 61.0 62.0 62.0 62.0 61.0 62.0 62.0 62.0 62.0 61.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#10] stanford-crypto-aes Cycles:10 Average:85.90 Median:82.00 stddev:11.25 (13.7%) stddev-sans-first:11.73 14:43:49 INFO - PROCESS | 25646 | Values: 80.0 81.0 87.0 83.0 79.0 82.0 81.0 87.0 117.0 82.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#11] stanford-crypto-ccm Cycles:10 Average:129.50 Median:131.00 stddev:6.29 (4.8%) stddev-sans-first:5.66 14:43:49 INFO - PROCESS | 25646 | Values: 139.0 138.0 125.0 133.0 129.0 122.0 135.0 123.0 126.0 125.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.40 Median:164.00 stddev:2.80 (1.7%) stddev-sans-first:2.92 14:43:49 INFO - PROCESS | 25646 | Values: 162.0 165.0 169.0 166.0 161.0 161.0 165.0 163.0 162.0 160.0 14:43:49 INFO - PROCESS | 25646 | 14:43:49 INFO - PROCESS | 25646 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.40 Median:64.00 stddev:3.75 (5.9%) stddev-sans-first:3.94 14:43:49 INFO - PROCESS | 25646 | Values: 64.0 66.0 70.0 74.0 64.0 64.0 64.0 63.0 63.0 62.0 14:43:49 INFO - PROCESS | 25646 | -------- Summary: end -------- 14:43:49 INFO - PROCESS | 25646 | 14:43:50 INFO - TEST-INFO | 25646: exit 0 14:43:50 INFO - TEST-OK | kraken | took 62303ms 14:43:50 INFO - SUITE-END | took 1172s 14:43:51 INFO - Completed test suite (00:19:33) 14:43:51 INFO - javascript benchmark 14:43:51 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7297.132912915385, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3070.8311042892637, 3113.859876305566, 3148.039847846406, 3150.1494596458956, 3155.3058327168014, 5333.093374126393, 5361.061814182517, 5407.513323800862, 5420.891582168354, 5431.538319242869, 5286.603504737151, 5402.081646120159, 5456.345238571367, 5504.119340905456, 5527.640703354279, 4920.188168952128, 4960.875978100558, 5054.1407960646775, 5098.362704661918, 5151.098557752397, 688.8565498238435, 4794.544518270776, 4916.950830491685, 4934.333864928225, 5075.796968121271, 4872.975635121819, 4926.11329960607, 4930.433000204968, 4934.580560652349, 4954.9594585137165, 4985.651004429691, 4990.725510096943, 5005.74971251436, 5006.5494105530315, 5020.196768517057, 4924.039812236615, 4934.580560652349, 4995.075910956485, 4996.900061998776, 5006.048850718352, 5399.865003374908, 5437.483439073281, 5444.863878403032, 5454.645448045864, 5456.208849716809, 5664.603477756558, 5802.709864506758, 5835.649861008353, 5856.648601083906, 5857.4435428634215, 5897.14491398749, 5922.792702255443, 5936.406359364072, 5941.049432090888, 6005.729742161613, 5498.3127109111365, 5523.917141242885, 5528.9723551382385, 5531.004419204542, 5535.501804837584, 5843.415658434123, 5966.105084237399, 6025.427584379477, 6037.245344331958, 6051.485623721945, 5818.301803783573, 5829.62107463022, 5844.503217226584, 5860.736266868002, 5877.617954832922, 5905.527557795366, 5908.911366329508, 5913.822585322448, 5914.970425147847, 5928.258967629046, 5610.579206559442, 5752.338481074647, 5795.507381872504, 5824.009918313896, 5899.675517846474, 5751.511121554631, 5835.0, 5836.941630583725, 5837.3870743571315, 5847.853803654943, 4436.578525040116, 4461.08547747711, 4462.085272519126, 4480.350349199348, 4484.484284307281, 3845.615438456132, 3897.4543563901075, 3936.4292177634084, 3968.543617483969, 3994.840206391712, 5601.831945041656, 5649.971750141223, 5653.265075540154, 5681.9431805681415, 5693.4875861172695, 5896.0, 5961.672108034013, 5967.104934259895, 5969.761209551656, 5978.983572792636, 5411.2965314508865, 5488.231647569343, 5535.806246781424, 5551.583631227674, 5642.210090587239, 5062.493750624908, 5069.290299358093, 5080.49195080489, 5087.033463641897, 5097.847064588068, 5961.195238642815, 6136.8772624548155, 6143.723532441051, 6147.170132032118, 6149.477294430024, 5856.677882716492, 5910.379410161871, 5922.970385147961, 5960.195373624679, 5966.313873904556, 6127.111568822585, 6149.169862068742, 6156.876862462816, 6162.753489860355, 6166.784162554289, 5596.496315331639, 5646.717664116695, 5807.535397168301, 5809.157672137601, 5811.970940145441, 5715.085586306337, 5820.76716931318, 5821.301443826768, 5833.300003999378, 5884.0585506318785, 5651.265335506522, 5697.943020569907, 5706.3152421709665, 5706.372299047019, 5713.371529131875, 5491.121420572689, 5647.943520564741, 5677.375488696158, 5679.346875109415, 5694.202811606461, 5599.496045355938, 5629.268195134607, 5676.4323567642905, 5681.204631351697, 5716.5998380113, 5770.365259821332, 5800.332961709458, 5803.071508558611, 5811.0, 5811.883762324815, 5423.891522169613, 5608.186812912187, 5638.097904335286, 5655.095184770582, 5702.7718891243885], "value": 5367.499601316916, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [571.2488078177199, 617.4597227426002, 617.8640699046211, 637.4836382530151, 641.8427485266111, 38808.0, 42994.570054299445, 42996.14007719848, 43044.354334685006, 43098.0, 43887.34168987468, 44651.0, 44718.32922506165, 44746.32880506795, 44751.0, 8676.869846952284, 8759.824803503927, 8854.07032261613, 8860.29117670588, 8860.556972151398, 8747.212750852423, 8810.471371717718, 8826.161514656098, 8846.911530884674, 8847.73456796297, 8821.073787252342, 8863.512506812154, 8899.911000890006, 8932.240759535447, 8932.866007009867, 8823.808785813897, 8870.911290887105, 8877.112288771103, 8881.511516866569, 8887.73336799897, 8701.521416322099, 8731.301495880314, 8790.912090879137, 8827.691030813954, 8827.911720882837, 41321.79339103285, 41719.374209386886, 41744.79127604373, 41781.03080207376, 41803.954901127414, 3525.4888041234135, 3615.963840361589, 3625.401808701561, 3758.5113935188524, 4014.080650059982, 33190.33619327624, 33347.0, 33361.16597085068, 33629.15927101817, 33646.33715930383, 4365.279728844736, 4370.344448332776, 4576.0, 4616.469106052779, 4649.093426781779, 346278.0, 350514.0, 351297.0, 351497.0, 352076.0, 34197.48703769445, 35214.471782923276, 59658.70170649119, 59931.0, 60126.0, 35537.1115722109, 35564.64435355665, 35600.64399355973, 35760.0, 35762.642373576455, 14980.400783968737, 14986.0, 15077.869159813057, 15078.849211507964, 15089.47186848455, 12131.878681213075, 12264.754704905852, 12329.93835030837, 12330.938345308396, 12387.814182787266, 8410.453320534145, 8432.114627964098, 8470.237678608832, 8540.701075462453, 8574.0, 3232.402005628966, 3262.5432439458496, 3273.492608645664, 3323.3519463704347, 3365.865365385357, 1027.5684212630713, 1057.9843350383717, 1062.0, 1176.4235524592889, 1199.646104399187, 33429.83285083559, 33579.496307555404, 33784.831075844464, 33815.154621134665, 34093.48859767106, 1127.7237076916044, 1131.1742428027421, 1160.611195249584, 1201.4893670190133, 1263.3178083834625, 17255.827441725673, 17495.825041749675, 17802.91098544499, 17833.375831845824, 17839.910800446174, 567553.0, 573944.0, 574600.0, 580814.3429959862, 586334.0, 58631.0, 59261.40738592559, 59328.0, 59354.0, 59743.402565974655, 1340.2092765268537, 1372.0464277327162, 1389.485890220625, 1396.2809153286066, 1406.7045920356636, 31377.0, 32819.0, 33120.1719957003, 33131.50302745509, 33580.496292555144, 51705.48294517157, 51831.0, 52399.73800130975, 52492.737536312074, 52557.737211313695, 470421.0, 472284.0, 472558.0, 472966.0, 473314.0, 26682.19953401401, 26747.0, 27036.1889143326, 28433.715662843108, 28458.85770571134, 48394.50340922019, 49166.26250606172, 49218.507814921395, 49976.50023499864, 50250.497495026044, 41436.792816036934, 41478.792606036775, 41527.792361038, 41531.1693766129, 42961.3555796657, 40442.39336409897, 41060.384094239205, 41789.791051045766, 41838.37242441305, 42538.0, 41821.372679410444, 42109.0, 42963.06666200091, 45276.0, 45958.310625339975, 37698.62301377061, 37802.243955121296, 38070.61929380782, 38890.416643750934, 38995.805020974716, 28344.14967550977, 28822.279443014093, 29020.419591608472, 29083.854580727806, 29111.12666620005], "value": 19197.589024761844, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [384.2775581906016, 389.2468074276276, 389.29343242015756, 398.53769627232407, 415.0909508177092, 17789.37737179199, 18782.53043673909, 19224.61550768984, 19230.711539326905, 19868.60262794743, 18277.177527011285, 18526.907365463187, 18953.33663321784, 18998.14508347124, 19271.61456770867, 5538.889222215554, 5647.463490968372, 5798.0, 5813.593048486608, 5834.358220595752, 5692.8861422771515, 5721.5708821838525, 5740.196372507852, 5761.078227483604, 5769.480746732793, 5541.224228607998, 5698.829035128932, 5718.056520674084, 5727.055035919068, 5744.3394009689, 5644.153376993443, 5676.858078548028, 5684.9147262790675, 5688.658680479184, 5694.857628559278, 4954.950450495485, 5122.820701275475, 5129.487051294878, 5138.460461651547, 5167.844964651066, 16769.496915092568, 16784.0, 16799.66400671992, 21594.460138496506, 21836.017379217974, 2079.376187143851, 2561.859097749623, 2623.4490756941063, 2904.7385735283924, 2905.8692358843905, 10479.109275711573, 10637.9468102659, 11514.827277590843, 13041.282729449877, 14755.926220368936, 1987.7217189593468, 2041.5202427429542, 2054.2707338894625, 2057.094878253564, 2079.07481170879, 78659.0, 79549.60225198837, 80409.0, 80480.19519804786, 81693.59153204256, 10660.946695266473, 10714.589217426017, 10793.67618971432, 10935.28920620157, 11068.335899846035, 15091.54725358241, 15126.092434453967, 15286.38854445832, 15293.694126117416, 15345.539633811004, 7886.329661978796, 7960.363170946426, 7977.680892764224, 8104.311133553596, 8153.266206041485, 7672.271134242238, 7676.155622881479, 7774.06711194649, 7830.491018083806, 7864.842703145905, 4642.489326174118, 4645.187092258909, 4718.4809670936165, 4750.144973904661, 4795.352627395327, 1894.6400183965002, 1952.5801952580264, 1977.406777966633, 1991.412533302679, 1998.5403357227628, 889.7908991387019, 958.712386284112, 1018.2464975917768, 1043.3009883378154, 1043.8434234864678, 18755.437336879917, 19044.333448329242, 19142.330018449287, 19308.32420865291, 19514.60970780605, 945.5744914788236, 964.81668482988, 985.5909797434128, 1016.9694909152737, 1052.8789189243182, 10298.07317341428, 10743.570257189782, 10803.297785643908, 10860.45697715111, 10891.400972946563, 458392.0, 459723.0, 464389.0, 467615.0, 469821.0, 90786.0, 92886.39964920389, 94200.52899735457, 95522.0, 103582.48208758907, 1040.547361897577, 1050.9054185123375, 1056.1339701444895, 1074.8065348237235, 1086.5925278020743, 17447.651046979245, 17940.461786146436, 17950.91024544869, 18013.2794688211, 18273.3604323848, 38066.429003564415, 39843.402348964206, 40572.0, 40944.385834213106, 41595.58404416038, 58398.0, 59292.703536483765, 59395.0, 59804.40195597988, 61241.0, 8236.50580965144, 8390.077091519806, 8462.83074338522, 8533.317334613092, 8714.520701361485, 9540.045995400404, 12482.812757808822, 12557.434915428645, 13104.868951310746, 13552.728945421233, 11820.70448238801, 11954.58158964432, 11993.160478766402, 12057.939710301744, 12079.51681932713, 11695.649130526097, 11846.822297665714, 11911.463984120563, 11946.0, 12054.75890482168, 12009.819852702041, 12118.333491658044, 12152.817707734213, 12230.816537751763, 12348.814767778671, 7174.605396703231, 7578.12851522082, 7899.368050556057, 8043.959780201061, 8891.955540222258, 11340.149488788209, 12095.334756588472, 12129.454174562343, 12140.635780926234, 12161.087918406332], "value": 9197.686803232396, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1485.7548504496756, 1535.7619568966809, 1657.4447560067376, 1788.7942886568048, 1803.9909800450996, 7786.377089832814, 8620.698275560357, 8814.735557933256, 9275.443473391593, 9294.721158365242, 8826.382153249275, 9092.8636070459, 9101.499417532033, 9108.134727200922, 9132.54337283135, 2332.7200735911715, 2393.078664714089, 2398.292503711409, 2404.158544509425, 2406.5547873643345, 2321.767823217673, 2347.530493901218, 2390.3904504351367, 2394.042383046778, 2405.8315917885757, 2362.137819695816, 2380.5595964746576, 2385.7614238576175, 2407.518496300738, 2419.0565679385054, 2307.3885420363617, 2332.2769941318074, 2340.2979106268053, 2357.163207061503, 2357.705286839145, 2291.954160916789, 2304.9654255186188, 2306.1467257114973, 2321.6981792367055, 2339.6256598944087, 8974.28205743539, 9003.639854405816, 9081.409708369001, 9117.954410227972, 9120.315976301805, 5190.273361729361, 5326.680399176062, 5400.810971615974, 5429.239906413066, 5454.4545545445535, 3379.8817041403677, 3396.473546600256, 3490.703290220334, 3500.072480792592, 3506.5792104947313, 1095.901368876797, 1106.4080716816466, 1143.822707480342, 1181.1318680769627, 1185.3006726031597, 12582.937085314516, 12603.117781755282, 12623.684407889785, 12651.493940242379, 12662.873371266262, 4607.101615185007, 4629.120467111238, 4743.169945259635, 4755.239161734106, 4792.161371759928, 10639.0, 10639.414832184304, 10657.626983055556, 10714.73213169677, 10729.141668666489, 5420.539254163361, 5426.186072089218, 5428.782848686008, 5442.455754424526, 5468.535174510212, 4180.226658068206, 4599.241125214369, 4692.694974826625, 4826.0347930414055, 4841.346418233564, 4003.799810009488, 4069.7354671946227, 4090.5909409058854, 4123.072308730511, 4153.833846646161, 1271.879171478708, 1277.9105462617713, 1279.05350040969, 1280.5390059578544, 1283.1723538317733, 805.162630863895, 900.2707806676613, 936.878205833251, 964.2816102004052, 995.1541189988596, 5863.648181109147, 6012.488938440281, 6082.787102451482, 6103.023516237469, 6104.084387341845, 1036.4558606731525, 1060.9363438193734, 1078.009401590737, 1091.6015654286286, 1105.5190991918541, 3926.3325234709596, 4082.1631565528996, 4099.836006559704, 4140.937885931713, 4152.5432202457705, 11123.610673626385, 11273.661790146145, 11430.714232144262, 11443.771124577628, 11517.48171332292, 11176.776464470828, 11232.719182020352, 11305.660830175108, 11350.375729334966, 11384.260023098472, 8426.368022398345, 8575.0, 8578.828423431622, 8599.226069653761, 8755.912440875638, 5880.0, 6018.4583387493585, 6040.09398590215, 6057.757689692363, 6087.239095113111, 10225.84661230097, 10624.734381640521, 10718.73203169927, 10743.623973160902, 10765.407902565434, 10518.158547316349, 10679.87861274555, 10756.247062705535, 10930.289531180448, 10941.617043403761, 6523.7716679915975, 7456.51532650376, 7565.0, 7612.96193519051, 7664.961675191588, 8933.776655583662, 8938.4190027648, 8973.596188171417, 8989.595468203815, 8999.245147196234, 7484.363829074589, 7720.034995625547, 7822.608869556613, 7867.409944254089, 7888.329491993245, 7772.68909243624, 7991.400644951768, 7995.440319177602, 8033.397495187767, 8035.397345199017, 7231.4214862809795, 7246.746363877239, 7358.889616655647, 7366.558006519626, 7397.297256760599, 5128.8461346159675, 5221.477852214748, 5252.107141785829, 5314.707691076873, 5320.707361095022, 5262.526372626482, 5266.131088370529, 5301.893962120659, 5427.0231358354295, 5438.102713052302], "value": 4754.480489615708, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [323.87530800641747, 335.06349752441923, 339.1758027991979, 339.51618943006224, 341.73515525467747, 5390.595705322097, 5499.807506737265, 5556.888862222758, 5647.6893770842635, 5657.660540367576, 5435.673859568428, 5600.1599760036015, 5616.550675945925, 5625.606207565472, 5647.661140331583, 4269.502341130443, 4291.463567054118, 4293.763842988635, 4307.719998200107, 4319.524852266248, 4082.7547597982602, 4279.465066866642, 4287.5069367022725, 4338.869833904988, 4342.652587792969, 4236.368997935786, 4240.851570195044, 4247.25673007224, 4265.274903266452, 4269.338252570857, 4255.191543593975, 4262.190183865056, 4292.334688123346, 4295.334223195409, 4301.698881078326, 3554.5201397811225, 3766.114962983697, 3788.3749181385315, 3807.904802379935, 3812.80935953204, 5290.444503327134, 5293.550048245904, 5384.1923711443205, 5389.197617239053, 5397.54120899724, 4822.132016237076, 4833.879153021167, 4854.320395144682, 4862.878428039292, 4890.413150421937, 5584.4136365681425, 5746.683932383718, 5781.942180578182, 5798.565107616945, 5814.534837213013, 4074.694397920168, 4088.7546747195265, 4107.486564179478, 4112.9717570607345, 4123.731957422758, 6062.848428789272, 6095.756169753205, 6101.206843110367, 6111.755529778803, 6121.66330851803, 3966.631512128311, 4175.457190565207, 4188.4136220929095, 4195.832166713297, 4213.831446742096, 4282.314829627245, 4287.335463003239, 4289.420928174719, 4291.892702682396, 4302.397664326997, 4857.101436234308, 4905.681130726492, 4933.481984391659, 4961.776720047606, 4977.153883839684, 5330.307060082165, 5842.211301474246, 5868.794592189253, 5884.911726324109, 5913.793017244462, 1458.8905832062426, 1463.978040329396, 1475.42458441208, 1479.52655150353, 1485.5543336998858, 921.8067022826615, 932.5710173320349, 937.840567103594, 944.2964991081689, 945.333539854401, 5090.949090509122, 5091.439941606421, 5151.639385242997, 5168.449465160436, 5174.870628234325, 5336.706481143575, 5396.892062158813, 5399.244105825188, 5408.540274076748, 5409.648372855751, 5057.6459647824295, 5134.383873935151, 5157.535821776059, 5477.561795056386, 5870.060790273621, 3229.709326160657, 3240.465323221642, 3242.643309235982, 3255.316383559432, 3256.820874851906, 6000.268668746351, 6192.828987795241, 6238.906416403757, 6330.746770129235, 6340.239171299474, 6123.0, 6135.693215339215, 6153.630782153085, 6205.162303089115, 6231.9688401557705, 6231.102537320168, 6252.562320637512, 6353.682315884187, 6359.300476947532, 6408.359164083555, 5762.971185144047, 6039.909401358896, 6041.365656605993, 6058.636481811105, 6072.8785424292155, 5949.613275137102, 6026.156338112755, 6064.4541991221, 6100.603460775035, 6120.357362476876, 6059.787907423395, 6261.966775482177, 6265.74937002533, 6375.6174629522375, 6400.935990640034, 4194.601512856274, 4204.558521355214, 4218.367244913287, 4222.176675548361, 4224.767637779952, 5754.136879467946, 5951.672658003851, 6087.482563982111, 6091.634501929899, 6111.786087486917, 5857.410413285054, 5879.2944846618675, 5891.23413956183, 5909.3795151508475, 5924.763009479572, 5824.301083869963, 5832.445917637818, 5832.737526811219, 5867.20792692981, 5870.853228669317, 5480.068388373907, 5741.5119714824705, 5765.394633563583, 5767.3367562729145, 5786.0, 5881.73532191061, 5906.320773110975, 5922.437368449991, 5938.435848594377, 5967.254093238345, 5503.944960550343, 5797.6521408713925, 5807.8548036299435, 5838.182654428469, 5849.912251316318], "value": 4405.372150118184, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [755.9508631938927, 767.1484652036239, 810.461043406135, 821.7822277096568, 848.7581039403769, 14634.268286585668, 14647.316571679534, 14762.926185369084, 14806.555803325904, 14830.48093316734, 13603.251821149834, 13891.861081389183, 13915.956303277244, 14014.299285035759, 14028.579142625738, 798.9081255655601, 811.5698679699768, 813.4102775487784, 815.3925325632412, 816.7549735079482, 799.7800604833689, 814.7433558429076, 831.8419500294955, 836.4103307168432, 838.0362583029504, 861.4788053227801, 865.2991077227466, 865.5974971638187, 866.5883705239992, 871.8692196170562, 863.9654413823471, 866.4627930682954, 867.5922316511229, 867.8351113288455, 869.9304055675531, 623.4295619508144, 626.4174317884366, 629.7481007596953, 630.1304200203735, 631.2897989761518, 14821.925890370587, 14843.10941343512, 14853.331600078023, 14964.02733822309, 14985.625359365995, 14186.148831070168, 14338.211398373085, 14394.280285985764, 14449.566513004627, 14647.487337943121, 12035.780167762967, 12044.81932771009, 12192.81710774339, 12281.938590307082, 12778.488860445572, 3920.137569734654, 3922.882313530599, 3967.4048892666333, 4068.698016634678, 4073.06319546506, 75943.0, 77649.83525247125, 78027.60986195033, 78609.60695196487, 78829.0, 11782.205894097997, 11840.467178976967, 11848.348340841336, 11861.288322700666, 12173.634790956285, 21862.23482178148, 21918.23286184976, 21941.122355105617, 21948.670769938464, 22023.0, 8056.234657707509, 8061.355091592659, 8197.508149511048, 8239.052508961546, 8356.958215208884, 4751.6436267279405, 4792.353032340659, 4960.255961605716, 4965.4041515018425, 5029.547340739351, 3655.3054919565197, 3797.9050523736573, 3802.429635554689, 3809.466674665549, 3818.198178382571, 615.8829822333743, 620.0915658560231, 621.0683974038942, 632.6330728177646, 641.1408712325506, 603.9818805435845, 696.7979286007002, 711.4095300900241, 738.3391864281546, 752.9134149572869, 9948.303618746762, 10545.31455455393, 10737.302075365076, 10738.409387483764, 10840.186985975926, 725.2424097917677, 746.8879668049727, 755.7468248136936, 769.7036640893184, 795.8766391209372, 4902.509749025069, 4916.459189489154, 5027.874303142451, 5039.21892106724, 5046.243063540425, 71193.0, 72110.63944680244, 72146.63926680334, 113920.88632909347, 113926.43036784763, 91916.54041729748, 94485.0, 95869.0, 96186.0, 99647.50176249217, 83382.58308708538, 87448.5627571858, 87712.5614371924, 89415.55292223497, 89654.55172724095, 9596.712098637052, 9698.36960597559, 9799.804003920024, 9814.607415703293, 9854.21166306708, 49550.50449495459, 50583.241251381995, 50885.236721449946, 51067.0, 51884.48115518797, 66407.33592664011, 70098.64950675418, 72184.63907680428, 74732.25267747471, 75233.24766752482, 11346.092312615136, 11497.310161390344, 11626.069914406658, 11721.0, 11835.82246266324, 14302.642433938818, 15145.242737863284, 15489.922550387177, 15636.530904072895, 15756.369745210062, 13099.738005240033, 13657.590272291847, 15098.320575574346, 15107.848921510644, 15385.610251104248, 14164.220967846868, 14602.601550218094, 14638.780418293947, 14664.70670586561, 14828.110313381232, 11236.494357754083, 13136.73726525445, 13567.660808479472, 14029.719405612035, 14140.717185656435, 11087.279326843729, 11223.214374993671, 11242.0, 11689.298642081503, 11758.0, 11395.35925238467, 11665.59170429031, 12015.339156346135, 12254.38728063611, 12316.445759941003], "value": 7604.83611390296, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1549.3000000000004, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 108.0, 111.0, 109.0, 112.0, 114.0, 116.0, 112.0, 117.0, 113.0], "value": 112.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [151.0, 132.0, 153.0, 177.0, 133.0, 156.0, 158.0, 128.0, 184.0, 133.0], "value": 150.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 166.0, 163.0, 164.0, 165.0, 176.0, 163.0, 163.0, 165.0, 163.0], "value": 165.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 75.0, 161.0, 76.0, 75.0, 75.0, 76.0, 168.0, 77.0], "value": 93.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 86.0, 165.0, 86.0, 86.0, 87.0, 149.0, 86.0, 86.0, 159.0], "value": 107.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 117.0, 119.0, 117.0, 117.0, 117.0, 117.0, 118.0], "value": 117.4, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 147.0, 147.0, 148.0, 147.0, 148.0, 147.0, 147.0, 147.0, 147.0], "value": 147.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 95.0, 95.0, 96.0, 94.0, 95.0, 96.0, 95.0, 97.0, 96.0], "value": 95.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 53.0, 54.0, 55.0, 53.0, 53.0, 54.0, 56.0, 52.0, 53.0], "value": 53.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 62.0, 62.0, 62.0, 61.0, 62.0, 62.0, 62.0, 62.0, 61.0], "value": 61.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 81.0, 87.0, 83.0, 79.0, 82.0, 81.0, 87.0, 117.0, 82.0], "value": 85.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [139.0, 138.0, 125.0, 133.0, 129.0, 122.0, 135.0, 123.0, 126.0, 125.0], "value": 129.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 165.0, 169.0, 166.0, 161.0, 161.0, 165.0, 163.0, 162.0, 160.0], "value": 163.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 66.0, 70.0, 74.0, 64.0, 64.0, 64.0, 63.0, 63.0, 62.0], "value": 65.4, "unit": "score"}]}]} 14:43:51 INFO - Return code: 0 14:43:51 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 14:43:51 ERROR - # TBPL SUCCESS # 14:43:51 INFO - Running post-action listener: _resource_record_post_action 14:43:51 INFO - ##### 14:43:51 INFO - ##### Finished run-tests step (success) 14:43:51 INFO - ##### 14:43:51 INFO - Running post-run listener: _resource_record_post_run 14:43:51 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 4096; Write bytes: 558055424; Read time: 256; Write time: 531304 14:43:51 INFO - TinderboxPrint: CPU usage
13.5% 14:43:51 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 256 14:43:51 INFO - TinderboxPrint: I/O write bytes / time
558,055,424 / 531,304 14:43:51 INFO - TinderboxPrint: CPU idle
8,219.2 (86.5%) 14:43:51 INFO - TinderboxPrint: CPU user
1,225.8 (12.9%) 14:43:51 INFO - TinderboxPrint: Swap in / out
0 / 0 14:43:51 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 189943808; Read time: 0; Write time: 205464 14:43:51 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 4096; Write bytes: 291815424; Read time: 256; Write time: 258112 14:43:51 INFO - Running post-run listener: _upload_blobber_files 14:43:51 INFO - Blob upload gear active. 14:43:51 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 14:43:51 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 14:43:51 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'] 14:43:51 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 14:43:52 INFO - (blobuploader) - INFO - Open directory for files ... 14:43:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 14:43:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:43:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:43:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 14:43:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:43:52 INFO - (blobuploader) - INFO - Done attempting. 14:43:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 14:43:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:43:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:43:56 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 14:43:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:43:56 INFO - (blobuploader) - INFO - Done attempting. 14:43:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 14:43:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:43:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:43:57 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 14:43:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:43:57 INFO - (blobuploader) - INFO - Done attempting. 14:43:57 INFO - (blobuploader) - INFO - Iteration through files over. 14:43:57 INFO - Return code: 0 14:43:57 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 14:43:57 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 14:43:57 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/99ee76cdd413e3eed3de9afc80a63ea2a77c89b011717e934d9a538dcb013b2309b9f8e623531cfdb31f52fecfbf61c8528b9604ec5a222602ea515183535875", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c4617835dfa6473b03044fa3b13e5a23bffca864d0643579a0398d6954e47ed79ea7ff6c98b290b5f42a5631dfd7e5aaa5342f348a11caaadec8f31fbcdb6d77", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/eccc37ed183f7ddec479709ad4fa07e28037c7c5b30e0adae06eee6a4a0ee82d885252db4f407ed249df182ea6da6b24d31723cb8c162faba4c0d19f6b342b02"} 14:43:57 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 14:43:57 INFO - Writing to file /builds/slave/test/properties/blobber_files 14:43:57 INFO - Contents: 14:43:57 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/99ee76cdd413e3eed3de9afc80a63ea2a77c89b011717e934d9a538dcb013b2309b9f8e623531cfdb31f52fecfbf61c8528b9604ec5a222602ea515183535875", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c4617835dfa6473b03044fa3b13e5a23bffca864d0643579a0398d6954e47ed79ea7ff6c98b290b5f42a5631dfd7e5aaa5342f348a11caaadec8f31fbcdb6d77", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/eccc37ed183f7ddec479709ad4fa07e28037c7c5b30e0adae06eee6a4a0ee82d885252db4f407ed249df182ea6da6b24d31723cb8c162faba4c0d19f6b342b02"} 14:43:57 INFO - Running post-run listener: copy_logs_to_upload_dir 14:43:57 INFO - Copying logs to upload dir... 14:43:57 INFO - mkdir: /builds/slave/test/build/upload/logs 14:43:57 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.304033 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-06-05 14:43:55.181954) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-05 14:43:55.185982) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/99ee76cdd413e3eed3de9afc80a63ea2a77c89b011717e934d9a538dcb013b2309b9f8e623531cfdb31f52fecfbf61c8528b9604ec5a222602ea515183535875", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c4617835dfa6473b03044fa3b13e5a23bffca864d0643579a0398d6954e47ed79ea7ff6c98b290b5f42a5631dfd7e5aaa5342f348a11caaadec8f31fbcdb6d77", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/eccc37ed183f7ddec479709ad4fa07e28037c7c5b30e0adae06eee6a4a0ee82d885252db4f407ed249df182ea6da6b24d31723cb8c162faba4c0d19f6b342b02"} build_url:https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011337 build_url: 'https://queue.taskcluster.net/v1/task/DsZ4E4-XT0CijUL0Dog8xA/artifacts/public/build/firefox-49.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/99ee76cdd413e3eed3de9afc80a63ea2a77c89b011717e934d9a538dcb013b2309b9f8e623531cfdb31f52fecfbf61c8528b9604ec5a222602ea515183535875", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/c4617835dfa6473b03044fa3b13e5a23bffca864d0643579a0398d6954e47ed79ea7ff6c98b290b5f42a5631dfd7e5aaa5342f348a11caaadec8f31fbcdb6d77", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/eccc37ed183f7ddec479709ad4fa07e28037c7c5b30e0adae06eee6a4a0ee82d885252db4f407ed249df182ea6da6b24d31723cb8c162faba4c0d19f6b342b02"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-05 14:43:55.211361) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-05 14:43:55.211736) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1465160085.881705-1364484324 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004384 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-05 14:43:55.294472) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-05 14:43:55.294827) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-05 14:43:55.295136) ========= ========= Total master_lag: 0.16 =========