builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-017 starttime: 1470274679.17 results: success (0) buildid: 20160803165059 builduid: 5d3e703a7d0f446b9ed01ff003c01624 revision: 757b6fae6d6b0e882d3c1f0ea94ade2902918c19 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-03 18:37:59.169920) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-03 18:37:59.170370) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-03 18:37:59.170891) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-03 18:37:59.212133) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-03 18:37:59.212730) ========= 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=0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-03 18:37:59-- 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% 112M=0s 2016-08-03 18:37:59 (112 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.183089 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-03 18:37:59.427541) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-03 18:37:59.427976) ========= 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=0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.067096 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-03 18:37:59.506869) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-03 18:37:59.507189) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 757b6fae6d6b0e882d3c1f0ea94ade2902918c19 --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 757b6fae6d6b0e882d3c1f0ea94ade2902918c19 --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=0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-03 18:37:59,571 truncating revision to first 12 chars 2016-08-03 18:37:59,571 Setting DEBUG logging. 2016-08-03 18:37:59,571 attempt 1/10 2016-08-03 18:37:59,571 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/757b6fae6d6b?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-03 18:37:59,883 unpacking tar archive at: fx-team-757b6fae6d6b/testing/mozharness/ program finished with exit code 0 elapsedTime=0.651514 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-03 18:38:00.174850) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-03 18:38:00.175452) ========= script_repo_revision: 757b6fae6d6b0e882d3c1f0ea94ade2902918c19 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-03 18:38:00.176040) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-03 18:38:00.176485) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-03 18:38:00.205711) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-08-03 18:38:00.206200) ========= /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=0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:38:00 INFO - MultiFileLogger online at 20160803 18:38:00 in /builds/slave/test 18:38:00 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 18:38:00 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:38:00 INFO - {'append_to_log': False, 18:38:00 INFO - 'base_work_dir': '/builds/slave/test', 18:38:00 INFO - 'blob_upload_branch': 'Fx-Team', 18:38:00 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:38:00 INFO - 'branch': 'Fx-Team', 18:38:00 INFO - 'buildbot_json_path': 'buildprops.json', 18:38:00 INFO - 'config_files': ('talos/linux_config.py',), 18:38:00 INFO - 'default_actions': ('clobber', 18:38:00 INFO - 'read-buildbot-config', 18:38:00 INFO - 'download-and-extract', 18:38:00 INFO - 'populate-webroot', 18:38:00 INFO - 'create-virtualenv', 18:38:00 INFO - 'install', 18:38:00 INFO - 'run-tests'), 18:38:00 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:38:00 INFO - 'download_minidump_stackwalk': True, 18:38:00 INFO - 'download_symbols': 'ondemand', 18:38:00 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:38:00 INFO - 'tooltool.py': '/tools/tooltool.py', 18:38:00 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:38:00 INFO - '/tools/misc-python/virtualenv.py')}, 18:38:00 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:38:00 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:38:00 INFO - 'installer_path': 'installer.exe', 18:38:00 INFO - 'log_level': 'info', 18:38:00 INFO - 'log_name': 'talos', 18:38:00 INFO - 'log_to_console': True, 18:38:00 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:38:00 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:38:00 INFO - 'opt_config_files': (), 18:38:00 INFO - 'pip_index': False, 18:38:00 INFO - 'sps_profile': False, 18:38:00 INFO - 'sps_profile_interval': 0, 18:38:00 INFO - 'suite': 'dromaeojs-e10s', 18:38:00 INFO - 'system_bits': '32', 18:38:00 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:38:00 INFO - 'title': 'talos-linux64-ix-017', 18:38:00 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:38:00 INFO - 'use_talos_json': True, 18:38:00 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:38:00 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:38:00 INFO - 'work_dir': 'build'} 18:38:00 INFO - [mozharness: 2016-08-04 01:38:00.459894Z] Running clobber step. 18:38:00 INFO - Running pre-action listener: _resource_record_pre_action 18:38:00 INFO - Running main action method: clobber 18:38:00 INFO - rmtree: /builds/slave/test/build 18:38:00 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:38:01 INFO - Running post-action listener: _resource_record_post_action 18:38:01 INFO - [mozharness: 2016-08-04 01:38:01.453237Z] Finished clobber step (success) 18:38:01 INFO - [mozharness: 2016-08-04 01:38:01.453341Z] Running read-buildbot-config step. 18:38:01 INFO - Running pre-action listener: _resource_record_pre_action 18:38:01 INFO - Running main action method: read_buildbot_config 18:38:01 INFO - Using buildbot properties: 18:38:01 INFO - { 18:38:01 INFO - "project": "", 18:38:01 INFO - "product": "firefox", 18:38:01 INFO - "script_repo_revision": "production", 18:38:01 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 18:38:01 INFO - "repository": "", 18:38:01 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 18:38:01 INFO - "buildid": "20160803165059", 18:38:01 INFO - "pgo_build": "True", 18:38:01 INFO - "basedir": "/builds/slave/test", 18:38:01 INFO - "buildnumber": 1008, 18:38:01 INFO - "slavename": "talos-linux64-ix-017", 18:38:01 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 18:38:01 INFO - "platform": "ubuntu64_hw", 18:38:01 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 18:38:01 INFO - "branch": "fx-team", 18:38:01 INFO - "repo_path": "integration/fx-team", 18:38:01 INFO - "revision": "757b6fae6d6b0e882d3c1f0ea94ade2902918c19", 18:38:01 INFO - "stage_platform": "linux64-pgo", 18:38:01 INFO - "builduid": "5d3e703a7d0f446b9ed01ff003c01624", 18:38:01 INFO - "slavebuilddir": "test" 18:38:01 INFO - } 18:38:01 INFO - Found installer url https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 18:38:01 INFO - Running post-action listener: _resource_record_post_action 18:38:01 INFO - [mozharness: 2016-08-04 01:38:01.455773Z] Finished read-buildbot-config step (success) 18:38:01 INFO - [mozharness: 2016-08-04 01:38:01.455862Z] Running download-and-extract step. 18:38:01 INFO - Running pre-action listener: _resource_record_pre_action 18:38:01 INFO - Running main action method: download_and_extract 18:38:01 INFO - mkdir: /builds/slave/test/build/tests 18:38:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:38:01 INFO - https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 18:38:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 18:38:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 18:38:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 18:38:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 18:38:02 INFO - Downloaded 1361 bytes. 18:38:02 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 18:38:02 INFO - Using the following test package requirements: 18:38:02 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 18:38:02 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:02 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 18:38:02 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:02 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 18:38:02 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:02 INFO - u'jsshell-linux-x86_64.zip'], 18:38:02 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:02 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 18:38:02 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 18:38:02 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:02 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 18:38:02 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:02 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 18:38:02 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:02 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 18:38:02 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 18:38:02 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 18:38:02 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 18:38:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 18:38:02 INFO - https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:38:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 18:38:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 18:38:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 18:38:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:38:03 INFO - Downloaded 21812926 bytes. 18:38:03 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:38:03 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 18:38:04 INFO - Return code: 0 18:38:04 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 18:38:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:38:04 INFO - https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:38:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 18:38:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 18:38:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 18:38:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:38:08 INFO - Downloaded 21812926 bytes. 18:38:08 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:38:08 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 18:38:10 INFO - Return code: 0 18:38:10 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')]} 18:38:10 INFO - https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 18:38:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 18:38:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 18:38:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 18:38:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 18:38:11 INFO - Downloaded 14413723 bytes. 18:38:11 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:38:11 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 18:38:12 INFO - Return code: 0 18:38:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:38:12 INFO - https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 18:38:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 18:38:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 18:38:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 18:38:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 18:38:13 INFO - Downloaded 59347692 bytes. 18:38:13 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 18:38:13 INFO - mkdir: /builds/slave/test/properties 18:38:13 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:38:13 INFO - Writing to file /builds/slave/test/properties/build_url 18:38:13 INFO - Contents: 18:38:13 INFO - build_url:https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 18:38:14 INFO - Running post-action listener: _resource_record_post_action 18:38:14 INFO - Running post-action listener: set_extra_try_arguments 18:38:14 INFO - [mozharness: 2016-08-04 01:38:14.148653Z] Finished download-and-extract step (success) 18:38:14 INFO - [mozharness: 2016-08-04 01:38:14.148888Z] Running populate-webroot step. 18:38:14 INFO - Running pre-action listener: _resource_record_pre_action 18:38:14 INFO - Running main action method: populate_webroot 18:38:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:38:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:38:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:38:14 INFO - '--tppagecycles', 18:38:14 INFO - '7'], 18:38:14 INFO - 'tests': ['tsvgm']}}, 18:38:14 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:38:14 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 18:38:14 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 18:38:14 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 18:38:14 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:14 INFO - 'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:38:14 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:38:14 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:14 INFO - 'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['damp', 'tps']}, 18:38:14 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:14 INFO - 'tests': ['damp', 'tps']}, 18:38:14 INFO - 'g3': {'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['dromaeo_dom']}, 18:38:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:38:14 INFO - 'g4': {'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['basic_compositor_video']}, 18:38:14 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 18:38:14 INFO - 'other': {'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['a11yr', 18:38:14 INFO - 'ts_paint', 18:38:14 INFO - 'tpaint', 18:38:14 INFO - 'sessionrestore', 18:38:14 INFO - 'sessionrestore_no_auto_restore', 18:38:14 INFO - 'tabpaint']}, 18:38:14 INFO - 'other-e10s': {'tests': ['a11yr', 18:38:14 INFO - 'ts_paint', 18:38:14 INFO - 'tpaint', 18:38:14 INFO - 'sessionrestore', 18:38:14 INFO - 'sessionrestore_no_auto_restore', 18:38:14 INFO - 'tabpaint']}, 18:38:14 INFO - 'other-e10s_l64': {'tests': ['a11yr', 18:38:14 INFO - 'ts_paint', 18:38:14 INFO - 'tpaint', 18:38:14 INFO - 'sessionrestore', 18:38:14 INFO - 'sessionrestore_no_auto_restore', 18:38:14 INFO - 'tabpaint']}, 18:38:14 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 18:38:14 INFO - 'ts_paint', 18:38:14 INFO - 'tpaint', 18:38:14 INFO - 'sessionrestore', 18:38:14 INFO - 'sessionrestore_no_auto_restore', 18:38:14 INFO - 'tabpaint']}, 18:38:14 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['a11yr', 18:38:14 INFO - 'ts_paint', 18:38:14 INFO - 'tpaint', 18:38:14 INFO - 'sessionrestore', 18:38:14 INFO - 'sessionrestore_no_auto_restore', 18:38:14 INFO - 'tabpaint']}, 18:38:14 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['a11yr', 18:38:14 INFO - 'ts_paint', 18:38:14 INFO - 'tpaint', 18:38:14 INFO - 'sessionrestore', 18:38:14 INFO - 'sessionrestore_no_auto_restore', 18:38:14 INFO - 'tabpaint']}, 18:38:14 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['tsvgx', 18:38:14 INFO - 'tsvgr_opacity', 18:38:14 INFO - 'tart', 18:38:14 INFO - 'tscrollx', 18:38:14 INFO - 'cart']}, 18:38:14 INFO - 'svgr-e10s': {'tests': ['tsvgx', 18:38:14 INFO - 'tsvgr_opacity', 18:38:14 INFO - 'tart', 18:38:14 INFO - 'tscrollx', 18:38:14 INFO - 'cart']}, 18:38:14 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:14 INFO - 'talos_options': ['--disable-e10s'], 18:38:14 INFO - 'tests': ['tp5o']}, 18:38:14 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:14 INFO - 'tests': ['tp5o']}, 18:38:14 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:14 INFO - 'talos_options': ['--disable-e10s', 18:38:14 INFO - '--xperf_path', 18:38:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:38:14 INFO - 'tests': ['tp5n']}, 18:38:14 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:38:14 INFO - 'talos_options': ['--xperf_path', 18:38:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:38:14 INFO - 'tests': ['tp5n']}}, 18:38:14 INFO - 'talos.zip': {'path': '', 18:38:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:38:14 INFO - Running post-action listener: _resource_record_post_action 18:38:14 INFO - [mozharness: 2016-08-04 01:38:14.165033Z] Finished populate-webroot step (success) 18:38:14 INFO - [mozharness: 2016-08-04 01:38:14.165122Z] Running create-virtualenv step. 18:38:14 INFO - Running pre-action listener: _resource_record_pre_action 18:38:14 INFO - Running main action method: create_virtualenv 18:38:14 INFO - Creating virtualenv /builds/slave/test/build/venv 18:38:14 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 18:38:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 18:38:14 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:38:14 INFO - Using real prefix '/usr' 18:38:14 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:38:14 INFO - Installing distribute.............................................................................................................................................................................................done. 18:38:17 INFO - Installing pip.................done. 18:38:17 INFO - Return code: 0 18:38:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:38:17 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')]} 18:38:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:17 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')]} 18:38:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:17 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 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38:17 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 18:38:17 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 18:38:17 INFO - Using env: {'DISPLAY': ':0', 18:38:17 INFO - 'HOME': '/home/cltbld', 18:38:17 INFO - 'LANG': 'en_US.UTF-8', 18:38:17 INFO - 'LANGUAGE': 'en_US:en', 18:38:17 INFO - 'LOGNAME': 'cltbld', 18:38:17 INFO - 'MAIL': '/var/mail/cltbld', 18:38:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:17 INFO - 'MOZ_NO_REMOTE': '1', 18:38:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:17 INFO - 'NO_EM_RESTART': '1', 18:38:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:17 INFO - 'PWD': '/builds/slave/test', 18:38:17 INFO - 'SHELL': '/bin/bash', 18:38:17 INFO - 'SHLVL': '1', 18:38:17 INFO - 'TERM': 'linux', 18:38:17 INFO - 'TMOUT': '86400', 18:38:17 INFO - 'USER': 'cltbld', 18:38:17 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:17 INFO - '_': '/tools/buildbot/bin/python'} 18:38:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:17 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 18:38:17 INFO - Cleaning up... 18:38:17 INFO - Return code: 0 18:38:17 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 18:38:17 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')]} 18:38:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:17 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')]} 18:38:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:17 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 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38:17 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 18:38:17 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 18:38:17 INFO - Using env: {'DISPLAY': ':0', 18:38:17 INFO - 'HOME': '/home/cltbld', 18:38:17 INFO - 'LANG': 'en_US.UTF-8', 18:38:17 INFO - 'LANGUAGE': 'en_US:en', 18:38:17 INFO - 'LOGNAME': 'cltbld', 18:38:17 INFO - 'MAIL': '/var/mail/cltbld', 18:38:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:17 INFO - 'MOZ_NO_REMOTE': '1', 18:38:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:17 INFO - 'NO_EM_RESTART': '1', 18:38:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:17 INFO - 'PWD': '/builds/slave/test', 18:38:17 INFO - 'SHELL': '/bin/bash', 18:38:17 INFO - 'SHLVL': '1', 18:38:17 INFO - 'TERM': 'linux', 18:38:17 INFO - 'TMOUT': '86400', 18:38:17 INFO - 'USER': 'cltbld', 18:38:17 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:17 INFO - '_': '/tools/buildbot/bin/python'} 18:38:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:17 INFO - Downloading/unpacking psutil>=3.1.1 18:38:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:38:19 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:38:19 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:38:19 INFO - Installing collected packages: psutil 18:38:19 INFO - Running setup.py install for psutil 18:38:19 INFO - building 'psutil._psutil_linux' extension 18:38:19 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 18:38:20 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 18:38:20 INFO - building 'psutil._psutil_posix' extension 18:38:20 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 18:38:20 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 18:38:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:38:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:38:21 INFO - Successfully installed psutil 18:38:21 INFO - Cleaning up... 18:38:21 INFO - Return code: 0 18:38:21 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 18:38:21 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')]} 18:38:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:21 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')]} 18:38:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:21 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 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38:21 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 18:38:21 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 18:38:21 INFO - Using env: {'DISPLAY': ':0', 18:38:21 INFO - 'HOME': '/home/cltbld', 18:38:21 INFO - 'LANG': 'en_US.UTF-8', 18:38:21 INFO - 'LANGUAGE': 'en_US:en', 18:38:21 INFO - 'LOGNAME': 'cltbld', 18:38:21 INFO - 'MAIL': '/var/mail/cltbld', 18:38:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:21 INFO - 'MOZ_NO_REMOTE': '1', 18:38:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:21 INFO - 'NO_EM_RESTART': '1', 18:38:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:21 INFO - 'PWD': '/builds/slave/test', 18:38:21 INFO - 'SHELL': '/bin/bash', 18:38:21 INFO - 'SHLVL': '1', 18:38:21 INFO - 'TERM': 'linux', 18:38:21 INFO - 'TMOUT': '86400', 18:38:21 INFO - 'USER': 'cltbld', 18:38:21 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:21 INFO - '_': '/tools/buildbot/bin/python'} 18:38:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:21 INFO - Downloading/unpacking mozsystemmonitor==0.3 18:38:21 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 18:38:21 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 18:38:21 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 18:38:21 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 18:38:21 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 18:38:21 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 18:38:23 INFO - Downloading mozsystemmonitor-0.3.tar.gz 18:38:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:38:23 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 18:38:23 INFO - Installing collected packages: mozsystemmonitor 18:38:23 INFO - Running setup.py install for mozsystemmonitor 18:38:23 INFO - Successfully installed mozsystemmonitor 18:38:23 INFO - Cleaning up... 18:38:23 INFO - Return code: 0 18:38:23 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 18:38:23 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')]} 18:38:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:23 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')]} 18:38:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:23 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 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38:23 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 18:38:23 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 18:38:23 INFO - Using env: {'DISPLAY': ':0', 18:38:23 INFO - 'HOME': '/home/cltbld', 18:38:23 INFO - 'LANG': 'en_US.UTF-8', 18:38:23 INFO - 'LANGUAGE': 'en_US:en', 18:38:23 INFO - 'LOGNAME': 'cltbld', 18:38:23 INFO - 'MAIL': '/var/mail/cltbld', 18:38:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:23 INFO - 'MOZ_NO_REMOTE': '1', 18:38:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:23 INFO - 'NO_EM_RESTART': '1', 18:38:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:23 INFO - 'PWD': '/builds/slave/test', 18:38:23 INFO - 'SHELL': '/bin/bash', 18:38:23 INFO - 'SHLVL': '1', 18:38:23 INFO - 'TERM': 'linux', 18:38:23 INFO - 'TMOUT': '86400', 18:38:23 INFO - 'USER': 'cltbld', 18:38:23 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:23 INFO - '_': '/tools/buildbot/bin/python'} 18:38:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:23 INFO - Downloading/unpacking jsonschema==2.5.1 18:38:23 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 18:38:23 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 18:38:23 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 18:38:23 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 18:38:23 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 18:38:23 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 18:38:25 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:38:25 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 18:38:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:25 INFO - Downloading functools32-3.2.3-2.tar.gz 18:38:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 18:38:25 INFO - warning: no files found matching '*.txt' 18:38:25 INFO - no previously-included directories found matching 'build' 18:38:25 INFO - no previously-included directories found matching 'dist' 18:38:25 INFO - no previously-included directories found matching '.git*' 18:38:25 INFO - Installing collected packages: jsonschema, functools32 18:38:25 INFO - Running setup.py install for functools32 18:38:25 INFO - warning: no files found matching '*.txt' 18:38:25 INFO - no previously-included directories found matching 'build' 18:38:25 INFO - no previously-included directories found matching 'dist' 18:38:25 INFO - no previously-included directories found matching '.git*' 18:38:25 INFO - Successfully installed jsonschema functools32 18:38:25 INFO - Cleaning up... 18:38:26 INFO - Return code: 0 18:38:26 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 18:38:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:38:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:38:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 18:38:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 18:38:26 INFO - Using env: {'DISPLAY': ':0', 18:38:26 INFO - 'HOME': '/home/cltbld', 18:38:26 INFO - 'LANG': 'en_US.UTF-8', 18:38:26 INFO - 'LANGUAGE': 'en_US:en', 18:38:26 INFO - 'LOGNAME': 'cltbld', 18:38:26 INFO - 'MAIL': '/var/mail/cltbld', 18:38:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:26 INFO - 'MOZ_NO_REMOTE': '1', 18:38:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:26 INFO - 'NO_EM_RESTART': '1', 18:38:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:26 INFO - 'PWD': '/builds/slave/test', 18:38:26 INFO - 'SHELL': '/bin/bash', 18:38:26 INFO - 'SHLVL': '1', 18:38:26 INFO - 'TERM': 'linux', 18:38:26 INFO - 'TMOUT': '86400', 18:38:26 INFO - 'USER': 'cltbld', 18:38:26 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:26 INFO - '_': '/tools/buildbot/bin/python'} 18:38:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:26 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 18:38:26 INFO - Cleaning up... 18:38:26 INFO - Return code: 0 18:38:26 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:38:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:38:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:38:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:26 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 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38:26 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 18:38:26 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 18:38:26 INFO - Using env: {'DISPLAY': ':0', 18:38:26 INFO - 'HOME': '/home/cltbld', 18:38:26 INFO - 'LANG': 'en_US.UTF-8', 18:38:26 INFO - 'LANGUAGE': 'en_US:en', 18:38:26 INFO - 'LOGNAME': 'cltbld', 18:38:26 INFO - 'MAIL': '/var/mail/cltbld', 18:38:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:26 INFO - 'MOZ_NO_REMOTE': '1', 18:38:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:26 INFO - 'NO_EM_RESTART': '1', 18:38:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:26 INFO - 'PWD': '/builds/slave/test', 18:38:26 INFO - 'SHELL': '/bin/bash', 18:38:26 INFO - 'SHLVL': '1', 18:38:26 INFO - 'TERM': 'linux', 18:38:26 INFO - 'TMOUT': '86400', 18:38:26 INFO - 'USER': 'cltbld', 18:38:26 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:26 INFO - '_': '/tools/buildbot/bin/python'} 18:38:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:26 INFO - Downloading/unpacking blobuploader==1.2.4 18:38:26 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 18:38:26 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 18:38:26 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 18:38:26 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 18:38:26 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 18:38:26 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 18:38:28 INFO - Downloading blobuploader-1.2.4.tar.gz 18:38:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:38:28 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:38:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:38:28 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:38:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:38:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:38:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:38:29 INFO - Downloading docopt-0.6.1.tar.gz 18:38:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:38:29 INFO - Installing collected packages: blobuploader, requests, docopt 18:38:29 INFO - Running setup.py install for blobuploader 18:38:29 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:38:29 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:38:29 INFO - Running setup.py install for requests 18:38:29 INFO - Running setup.py install for docopt 18:38:29 INFO - Successfully installed blobuploader requests docopt 18:38:29 INFO - Cleaning up... 18:38:29 INFO - Return code: 0 18:38:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:38:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:38:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:38:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:29 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 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38:29 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 18:38:29 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 18:38:29 INFO - Using env: {'DISPLAY': ':0', 18:38:29 INFO - 'HOME': '/home/cltbld', 18:38:29 INFO - 'LANG': 'en_US.UTF-8', 18:38:29 INFO - 'LANGUAGE': 'en_US:en', 18:38:29 INFO - 'LOGNAME': 'cltbld', 18:38:29 INFO - 'MAIL': '/var/mail/cltbld', 18:38:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:29 INFO - 'MOZ_NO_REMOTE': '1', 18:38:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:29 INFO - 'NO_EM_RESTART': '1', 18:38:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:29 INFO - 'PWD': '/builds/slave/test', 18:38:29 INFO - 'SHELL': '/bin/bash', 18:38:29 INFO - 'SHLVL': '1', 18:38:29 INFO - 'TERM': 'linux', 18:38:29 INFO - 'TMOUT': '86400', 18:38:29 INFO - 'USER': 'cltbld', 18:38:29 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:29 INFO - '_': '/tools/buildbot/bin/python'} 18:38:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:38:29 INFO - Running setup.py (path:/tmp/pip-FLtQ2y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:38:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:38:29 INFO - Running setup.py (path:/tmp/pip-9DrzU5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:38:30 INFO - Running setup.py (path:/tmp/pip-0saGTF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:38:30 INFO - Running setup.py (path:/tmp/pip-aSQSbB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:38:30 INFO - Running setup.py (path:/tmp/pip-r7K0Io-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:38:30 INFO - Running setup.py (path:/tmp/pip-iGRb1r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:38:30 INFO - Running setup.py (path:/tmp/pip-Eo_Hap-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:38:30 INFO - Running setup.py (path:/tmp/pip-Um7946-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:38:30 INFO - Running setup.py (path:/tmp/pip-VzMGGj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:38:30 INFO - Running setup.py (path:/tmp/pip-De_uXr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:38:30 INFO - Running setup.py (path:/tmp/pip-mUrRwG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:38:30 INFO - Running setup.py (path:/tmp/pip-FTexZm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:38:30 INFO - Running setup.py (path:/tmp/pip-pUtKTZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:38:30 INFO - Running setup.py (path:/tmp/pip-jdLLTK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:38:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:38:30 INFO - Running setup.py (path:/tmp/pip-DmruTb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:38:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:38:31 INFO - Running setup.py (path:/tmp/pip-aB3xlg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:38:31 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:38:31 INFO - Running setup.py (path:/tmp/pip-Ho9_u1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:38:31 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:38:31 INFO - Running setup.py install for manifestparser 18:38:31 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:38:31 INFO - Running setup.py install for mozcrash 18:38:31 INFO - Running setup.py install for mozdebug 18:38:31 INFO - Running setup.py install for mozdevice 18:38:31 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 18:38:31 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:38:31 INFO - Running setup.py install for mozfile 18:38:31 INFO - Running setup.py install for mozhttpd 18:38:31 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:38:31 INFO - Running setup.py install for mozinfo 18:38:31 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:38:31 INFO - Running setup.py install for mozInstall 18:38:31 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:38:31 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:38:31 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:38:31 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:38:31 INFO - Running setup.py install for mozleak 18:38:32 INFO - Running setup.py install for mozlog 18:38:32 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:38:32 INFO - Running setup.py install for moznetwork 18:38:32 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:38:32 INFO - Running setup.py install for mozprocess 18:38:32 INFO - Running setup.py install for mozprofile 18:38:32 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:38:32 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:38:32 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:38:32 INFO - Running setup.py install for mozrunner 18:38:32 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:38:32 INFO - Running setup.py install for mozscreenshot 18:38:32 INFO - Running setup.py install for moztest 18:38:32 INFO - Running setup.py install for mozversion 18:38:32 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:38:32 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:38:32 INFO - Cleaning up... 18:38:32 INFO - Return code: 0 18:38:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:38: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')]} 18:38:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38: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')]} 18:38:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:32 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 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38:32 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 18:38:32 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 18:38:32 INFO - Using env: {'DISPLAY': ':0', 18:38:32 INFO - 'HOME': '/home/cltbld', 18:38:32 INFO - 'LANG': 'en_US.UTF-8', 18:38:32 INFO - 'LANGUAGE': 'en_US:en', 18:38:32 INFO - 'LOGNAME': 'cltbld', 18:38:32 INFO - 'MAIL': '/var/mail/cltbld', 18:38:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:32 INFO - 'MOZ_NO_REMOTE': '1', 18:38:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:32 INFO - 'NO_EM_RESTART': '1', 18:38:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:32 INFO - 'PWD': '/builds/slave/test', 18:38:32 INFO - 'SHELL': '/bin/bash', 18:38:32 INFO - 'SHLVL': '1', 18:38:32 INFO - 'TERM': 'linux', 18:38:32 INFO - 'TMOUT': '86400', 18:38:32 INFO - 'USER': 'cltbld', 18:38:32 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:32 INFO - '_': '/tools/buildbot/bin/python'} 18:38:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:38:33 INFO - Running setup.py (path:/tmp/pip-p4RMz0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:38:33 INFO - Running setup.py (path:/tmp/pip-fyXDM2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:38:33 INFO - Running setup.py (path:/tmp/pip-wpZe3u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:38:33 INFO - Running setup.py (path:/tmp/pip-sjLOFz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:38:33 INFO - Running setup.py (path:/tmp/pip-ngtZET-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:38:33 INFO - Running setup.py (path:/tmp/pip-C5j2lI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:38:33 INFO - Running setup.py (path:/tmp/pip-s_E3CS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:38:33 INFO - Running setup.py (path:/tmp/pip-o3WrAB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:38:33 INFO - Running setup.py (path:/tmp/pip-yl2gnd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:38:33 INFO - Running setup.py (path:/tmp/pip-bT5PRc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:38:33 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:38:33 INFO - Running setup.py (path:/tmp/pip-L4zzzn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:38:33 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)) 18:38:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:38:33 INFO - Running setup.py (path:/tmp/pip-2s3b1o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:38:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 18:38:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:38:34 INFO - Running setup.py (path:/tmp/pip-rSE2CJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:38:34 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)) 18:38:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:38:34 INFO - Running setup.py (path:/tmp/pip-lHbnwh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:38:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 18:38:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:38:34 INFO - Running setup.py (path:/tmp/pip-6Fre3E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:38:34 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)) 18:38:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:38:34 INFO - Running setup.py (path:/tmp/pip-y8k70m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:38:34 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)) 18:38:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:38:34 INFO - Running setup.py (path:/tmp/pip-pxQ_4i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:38:34 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)) 18:38:34 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)) 18:38:34 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)) 18:38:34 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)) 18:38:34 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)) 18:38:34 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)) 18:38:34 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:38:34 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 18:38:34 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 18:38:34 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 18:38:34 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 18:38:34 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 18:38:34 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 18:38:36 INFO - Downloading blessings-1.6.tar.gz 18:38:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:38:36 INFO - Installing collected packages: blessings 18:38:36 INFO - Running setup.py install for blessings 18:38:36 INFO - Successfully installed blessings 18:38:36 INFO - Cleaning up... 18:38:36 INFO - Return code: 0 18:38:36 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:38:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:38:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:38:37 INFO - Reading from file tmpfile_stdout 18:38:37 INFO - Current package versions: 18:38:37 INFO - argparse == 1.2.1 18:38:37 INFO - blessings == 1.6 18:38:37 INFO - blobuploader == 1.2.4 18:38:37 INFO - docopt == 0.6.1 18:38:37 INFO - functools32 == 3.2.3-2 18:38:37 INFO - jsonschema == 2.5.1 18:38:37 INFO - manifestparser == 1.1 18:38:37 INFO - mozInstall == 1.12 18:38:37 INFO - mozcrash == 0.17 18:38:37 INFO - mozdebug == 0.1 18:38:37 INFO - mozdevice == 0.48 18:38:37 INFO - mozfile == 1.2 18:38:37 INFO - mozhttpd == 0.7 18:38:37 INFO - mozinfo == 0.9 18:38:37 INFO - mozleak == 0.1 18:38:37 INFO - mozlog == 3.3 18:38:37 INFO - moznetwork == 0.27 18:38:37 INFO - mozprocess == 0.23 18:38:37 INFO - mozprofile == 0.28 18:38:37 INFO - mozrunner == 6.12 18:38:37 INFO - mozscreenshot == 0.1 18:38:37 INFO - mozsystemmonitor == 0.3 18:38:37 INFO - moztest == 0.7 18:38:37 INFO - mozversion == 1.4 18:38:37 INFO - psutil == 3.1.1 18:38:37 INFO - requests == 1.2.3 18:38:37 INFO - wsgiref == 0.1.2 18:38:37 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:38: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')]} 18:38:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38: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')]} 18:38:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38:37 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 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38:37 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 18:38:37 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 18:38:37 INFO - Using env: {'DISPLAY': ':0', 18:38:37 INFO - 'HOME': '/home/cltbld', 18:38:37 INFO - 'LANG': 'en_US.UTF-8', 18:38:37 INFO - 'LANGUAGE': 'en_US:en', 18:38:37 INFO - 'LOGNAME': 'cltbld', 18:38:37 INFO - 'MAIL': '/var/mail/cltbld', 18:38:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:37 INFO - 'MOZ_NO_REMOTE': '1', 18:38:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:37 INFO - 'NO_EM_RESTART': '1', 18:38:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:37 INFO - 'PWD': '/builds/slave/test', 18:38:37 INFO - 'SHELL': '/bin/bash', 18:38:37 INFO - 'SHLVL': '1', 18:38:37 INFO - 'TERM': 'linux', 18:38:37 INFO - 'TMOUT': '86400', 18:38:37 INFO - 'USER': 'cltbld', 18:38:37 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:37 INFO - '_': '/tools/buildbot/bin/python'} 18:38:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:37 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)) 18:38:37 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)) 18:38:37 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)) 18:38:37 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)) 18:38:37 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)) 18:38:37 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)) 18:38:37 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)) 18:38:37 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)) 18:38:37 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)) 18:38:37 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)) 18:38:37 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)) 18:38:37 INFO - Cleaning up... 18:38:37 INFO - Return code: 0 18:38:37 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 18:38: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')]} 18:38:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:38:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38: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')]} 18:38:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:38:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:38: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xbed030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd508a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeae180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, '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': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', '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 18:38: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', 'jsonschema'] in /builds/slave/test/build 18:38: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 jsonschema 18:38:37 INFO - Using env: {'DISPLAY': ':0', 18:38:37 INFO - 'HOME': '/home/cltbld', 18:38:37 INFO - 'LANG': 'en_US.UTF-8', 18:38:37 INFO - 'LANGUAGE': 'en_US:en', 18:38:37 INFO - 'LOGNAME': 'cltbld', 18:38:37 INFO - 'MAIL': '/var/mail/cltbld', 18:38:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:37 INFO - 'MOZ_NO_REMOTE': '1', 18:38:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:37 INFO - 'NO_EM_RESTART': '1', 18:38:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:37 INFO - 'PWD': '/builds/slave/test', 18:38:37 INFO - 'SHELL': '/bin/bash', 18:38:37 INFO - 'SHLVL': '1', 18:38:37 INFO - 'TERM': 'linux', 18:38:37 INFO - 'TMOUT': '86400', 18:38:37 INFO - 'USER': 'cltbld', 18:38:37 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:37 INFO - '_': '/tools/buildbot/bin/python'} 18:38:37 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:38:37 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 18:38:37 INFO - Cleaning up... 18:38:37 INFO - Return code: 0 18:38:37 INFO - Running post-action listener: _resource_record_post_action 18:38:37 INFO - Running post-action listener: _start_resource_monitoring 18:38:37 INFO - Starting resource monitoring. 18:38:37 INFO - [mozharness: 2016-08-04 01:38:37.495387Z] Finished create-virtualenv step (success) 18:38:37 INFO - [mozharness: 2016-08-04 01:38:37.496335Z] Running install step. 18:38:37 INFO - Running pre-action listener: _resource_record_pre_action 18:38:37 INFO - Running main action method: install 18:38:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:38:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:38:37 INFO - Reading from file tmpfile_stdout 18:38:37 INFO - Detecting whether we're running mozinstall >=1.0... 18:38:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:38:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:38:37 INFO - Reading from file tmpfile_stdout 18:38:37 INFO - Output received: 18:38:37 INFO - Usage: mozinstall [options] installer 18:38:37 INFO - Options: 18:38:37 INFO - -h, --help show this help message and exit 18:38:37 INFO - -d DEST, --destination=DEST 18:38:37 INFO - Directory to install application into. [default: 18:38:37 INFO - "/builds/slave/test"] 18:38:37 INFO - --app=APP Application being installed. [default: firefox] 18:38:37 INFO - mkdir: /builds/slave/test/build/application 18:38:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 18:38:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 18:38:54 INFO - Reading from file tmpfile_stdout 18:38:54 INFO - Output received: 18:38:54 INFO - /builds/slave/test/build/application/firefox/firefox 18:38:54 INFO - Running post-action listener: _resource_record_post_action 18:38:54 INFO - [mozharness: 2016-08-04 01:38:54.632605Z] Finished install step (success) 18:38:54 INFO - [mozharness: 2016-08-04 01:38:54.632884Z] Running run-tests step. 18:38:54 INFO - Running pre-action listener: _resource_record_pre_action 18:38:54 INFO - Running main action method: run_tests 18:38:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:38:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:38:54 INFO - Python 2.7.3 18:38:54 INFO - Return code: 0 18:38:54 INFO - grabbing minidump binary from tooltool 18:38:54 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')]} 18:38:54 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 0xeac3b0>, '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 0xead2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xead740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:38:54 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 18:38:54 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 18:38:54 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 18:38:54 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:38:54 INFO - Return code: 0 18:38:54 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 18:38:54 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:38:54 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:38:54 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 18:38:54 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:38:54 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/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-017', '--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 18:38:54 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/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-017 --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 18:38:54 INFO - Using env: {'DISPLAY': ':0', 18:38:54 INFO - 'HOME': '/home/cltbld', 18:38:54 INFO - 'LANG': 'en_US.UTF-8', 18:38:54 INFO - 'LANGUAGE': 'en_US:en', 18:38:54 INFO - 'LOGNAME': 'cltbld', 18:38:54 INFO - 'MAIL': '/var/mail/cltbld', 18:38:54 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:38:54 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:38:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:38:54 INFO - 'MOZ_NO_REMOTE': '1', 18:38:54 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:38:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:38:54 INFO - 'NO_EM_RESTART': '1', 18:38:54 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:38:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:38:54 INFO - 'PWD': '/builds/slave/test', 18:38:54 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:38:54 INFO - 'SHELL': '/bin/bash', 18:38:54 INFO - 'SHLVL': '1', 18:38:54 INFO - 'TERM': 'linux', 18:38:54 INFO - 'TMOUT': '86400', 18:38:54 INFO - 'USER': 'cltbld', 18:38:54 INFO - 'XDG_SESSION_COOKIE': '0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836', 18:38:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:38:54 INFO - '_': '/tools/buildbot/bin/python'} 18:38:54 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/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-017', '--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 18:38:55 INFO - mozversion application_buildid: 20160803165059 18:38:55 INFO - mozversion application_changeset: 757b6fae6d6b0e882d3c1f0ea94ade2902918c19 18:38:55 INFO - mozversion application_display_name: Nightly 18:38:55 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:38:55 INFO - mozversion application_name: Firefox 18:38:55 INFO - mozversion application_remotingname: firefox 18:38:55 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 18:38:55 INFO - mozversion application_vendor: Mozilla 18:38:55 INFO - mozversion application_version: 51.0a1 18:38:55 INFO - mozversion platform_buildid: 20160803165059 18:38:55 INFO - mozversion platform_changeset: 757b6fae6d6b0e882d3c1f0ea94ade2902918c19 18:38:55 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 18:38:55 INFO - mozversion platform_version: 51.0a1 18:38:55 INFO - using testdate: 1470274735 18:38:55 INFO - actual date: 1470274735 18:38:55 INFO - starting webserver on 'localhost:38950' 18:38:55 INFO - SUITE-START | Running 2 tests 18:38:55 INFO - TEST-START | dromaeo_css 18:38:55 INFO - operating with platform_type : linux_ 18:38:55 INFO - Initialising browser for dromaeo_css test... 18:38:55 INFO - TEST-INFO | started process 3291 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0qQYfZ/profile http://localhost:38950/getInfo.html) 18:39:00 INFO - PROCESS | 3291 | __metrics Screen width/height:1600/1200 18:39:00 INFO - PROCESS | 3291 | colorDepth:24 18:39:00 INFO - PROCESS | 3291 | Browser inner width/height: 1024/697 18:39:00 INFO - PROCESS | 3291 | __metrics 18:39:01 ERROR - PROCESS | 3291 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 18:39:02 INFO - TEST-INFO | 3291: exit 0 18:39:02 INFO - Browser initialized. 18:39:02 INFO - Running cycle 1/1 for dromaeo_css test... 18:39:02 INFO - TEST-INFO | started process 3412 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0qQYfZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:39:14 INFO - PROCESS | 3412 | RSS: Main: 163672064 18:39:14 INFO - PROCESS | 3412 | 18:40:03 INFO - PROCESS | 3412 | 1470274803956 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] 18:42:13 INFO - PROCESS | 3412 | Cycle 1(1): loaded http://localhost:38950/tests/dromaeo/cssquery-dojo.html (next: http://localhost:38950/tests/dromaeo/cssquery-ext.html) 18:42:14 INFO - PROCESS | 3412 | RSS: Main: 166576128 18:42:14 INFO - PROCESS | 3412 | 18:45:16 INFO - PROCESS | 3412 | Cycle 1(1): loaded http://localhost:38950/tests/dromaeo/cssquery-ext.html (next: http://localhost:38950/tests/dromaeo/cssquery-jquery.html) 18:45:17 INFO - PROCESS | 3412 | RSS: Main: 165732352 18:45:17 INFO - PROCESS | 3412 | 18:48:19 INFO - PROCESS | 3412 | Cycle 1(1): loaded http://localhost:38950/tests/dromaeo/cssquery-jquery.html (next: http://localhost:38950/tests/dromaeo/cssquery-mootools.html) 18:48:19 INFO - PROCESS | 3412 | RSS: Main: 169725952 18:48:19 INFO - PROCESS | 3412 | 18:51:21 INFO - PROCESS | 3412 | Cycle 1(1): loaded http://localhost:38950/tests/dromaeo/cssquery-mootools.html (next: http://localhost:38950/tests/dromaeo/cssquery-prototype.html) 18:51:22 INFO - PROCESS | 3412 | RSS: Main: 164241408 18:51:22 INFO - PROCESS | 3412 | 18:54:24 INFO - PROCESS | 3412 | Cycle 1(1): loaded http://localhost:38950/tests/dromaeo/cssquery-prototype.html (next: http://localhost:38950/tests/dromaeo/cssquery-yui.html) 18:54:25 INFO - PROCESS | 3412 | RSS: Main: 166268928 18:54:25 INFO - PROCESS | 3412 | 18:57:27 INFO - PROCESS | 3412 | Cycle 1(1): loaded http://localhost:38950/tests/dromaeo/cssquery-yui.html (next: http://localhost:38950/tests/dromaeo/cssquery-dojo.html) 18:57:28 INFO - PROCESS | 3412 | RSS: Main: 169566208 18:57:28 INFO - PROCESS | 3412 | 18:57:28 INFO - PROCESS | 3412 | __start_tp_report 18:57:28 INFO - PROCESS | 3412 | _x_x_mozilla_page_load 18:57:28 INFO - PROCESS | 3412 | _x_x_mozilla_page_load_details 18:57:28 INFO - PROCESS | 3412 | |i|pagename|runs| 18:57:28 INFO - PROCESS | 3412 | |0;dojo.html;3098.4267910436565;3114.735247503962;3140.0736782649115;3143.497040473524;3148.937021259575;5333.626646134772;5392.975334686407;5437.564994800417;5455.127179651252;5470.8085217017415;5290.709011004393;5355.571554275658;5381;5415.9458405415935;5459.153831156177;4845.6123510119105;4861.222204447289;4951;4975.353204083464;4984.850454486353;4908.779104940286;4965.553100220979;5062.164742817431;5070.29015937769;5123.333966584358;4827.155247831615;4898.387701537308;4904.656674032819;4951.059298733229;4988.251762235657;4865.56209941107;4889.3888263967;4920;4937.456879743226;4940;4842.951570484285;4863.2461968394955;4863.319135321058;4890.70655760652;4974.10466116099;5331.1470164773455;5375.16684913839;5376.032314183445;5392.325959255093;5399.028174928511;5734.139879018139;5757.222774925415;5776.191333213354;5804.071348584249;5822.883542329129;5834.124881267801;5857.0335894577765;5869.325027621835;5875.794347197871;5876.471117599436;5400.081986062379;5440.211169380417;5465.262189604392;5475.945240547583;5482.91775623366;5750.971245143831;5850.707464626837;5891.351951285355;5933.614315069507;6003.129546215774;5697.886042279131;5734.799282025109;5740.856478587985;5754.827355179351;5760.884782304331;5776.451237132465;5839.474447299764;5842.5618078644275;5848.181254624356;5848.298204215522;5576.525995290364;5608.46719561641;5654.123610840326;5666;5746;5660.433956604389;5662.830115096472;5699.173619825185;5711.400302968212;5721.084626459747;4264.978675106605;4275.850345237902;4281.186574550826;4290.184864875664;4320.027993701455;3821.923561528754;3848.730588858753;3884.2231553689376;3894.1822217334675;3904.7852368119457;5554.805581804618;5596.468335508121;5604.047311956977;5609.1305847593685;5625.015622266087;5770.6249093808765;5787.102999035156;5807.128930660435;5832.475077242983;5892.381299963527;5472.644278121909;5481.260029895913;5485.533729633026;5513.393526712059;5600.159976003632;4935.087008903364;4940.431850337185;4953.628477864103;4957.082939656175;4962.305277261186;6033.456988871023;6059.848503787441;6071.696415179312;6074.817755467343;6096;5707.714614269353;5775.162601422686;5810.448007439287;5830.7959221427045;5894.941050589439;6130.938690613215;6149.508039356931;6160.784372546939;6163.845903852261;6166.321704612579;5697.857553561194;5709.457601527848;5732.054211055296;5738.971305143447;5758.337791154071;5644.6330988485615;5705.800296989752;5810.4189581041555;5817.272840894888;5834.15404766315;5654.378018418053;5689.943100569107;5693.3168019837885;5695.772169113189;5704.286964129484;5550.47270509301;5656.37779844225;5665.376808550974;5668.149777533403;5675.290588676416;5612.85967850807;5633.746481408429;5646.096624540054;5701.4298570142655;5782.045962416322;5723.427657234243;5758.25142731459;5768.884622307446;5780.075187969905;5782.045962416322;5454.6727196366755;5630.718464076862;5634.74643641029;5640.492355687844;5647.3787883333625 18:57:28 INFO - PROCESS | 3412 | |1;ext.html;546.071268823617;581.4418158567775;582.1616871704745;598.5331441475649;627.7300760672908;39009.609903900986;42089.57910420891;42216.788916055455;42323;42359.78820105899;43362.7831860841;44020;44034;44109.11781764363;44269.33595996063;8743.737687869358;8854.557272136399;8855.645774169025;8881.24509416697;8898.644054237822;8726;8814.162654547808;8873.645054197857;8875.733727988138;8893.466392016468;8890.066543012988;8906.777330566723;8914.73255802327;8930.910690893106;8940.329475289347;8842.5136617486;8850;8862.512561809099;8862.822743545157;8895.59969801354;8682.13178682133;8776.912230877737;8797.648094076229;8800.8679869802;8822.647094116228;35643.28713425743;35825.104372390895;36125.27749444996;36133.81933090344;36207;3832;4142.2543942090415;4210.947263184204;4220.07158425146;4427.512973572937;32496.350072998644;32554.837225813957;32605.83697081523;33187.33625327504;34064.48903266453;4129.855455059059;4185.937210941838;4223.598758117974;4249.936250956238;4315.956840431587;246102;246309.9999999982;246838;246844;247889;32621.18447038843;56166.719166403906;56224.71887640617;56341.436585633615;56387.43612563822;34876;36683.4497482538;36687.26625467476;36747;36872.26255474929;13240.146379506878;13305.068645194937;13402.731945361233;13404.128731632412;13420.731585368434;11976.28142311464;12113.818292725617;12147.93926030382;12153.878461215274;12177.086718496148;8419.326453883674;8587.828243435097;8616.526091065052;8727.083656216133;8748.387612867038;3384.4754063120254;3454.360943225461;3456.3087382523595;3504.6144924058335;3511.8068506232403;1037.096927138694;1094.414488248783;1156.9595064172881;1165.8717541070475;1183.1303991566192;33387.3322533548;33539.4969075464;33540.66459335375;33632;33632.83183584066;1145.1068166829887;1154.0940361815933;1231.6612931443924;1241.3420886929762;1246.5387806511467;16458.341666333214;17361.7395739064;17555.385561505285;17555.648887022442;17556.912215438842;530213.3489332529;530396;530403;532204;538767;58309.41690583125;58578.70710646419;58961;59182.704086479294;59207.40792592019;1328.2760895312078;1336.0981337597084;1379.0622376783883;1383.1286289637665;1390.7288078824733;30107.849460752557;32265;33533.66466335403;33569.66430335665;34724.13189670177;56886.431135688115;57460.42539574551;57505;57690.42309576851;57769.13346299725;493094;497326;497789;497792;498497;28550;29747.851260744425;29755.553666694585;30795;44549.77725111353;48122.518774811804;48255.27617085817;48441.75779121082;48617.5138248613;49209.507904920494;40301.39547906725;42582.14835703331;42824.78587607042;42835.357469638606;42844.571554284055;40242.39636405398;40806.1838763229;41957.16085678208;42581.14837703291;42634.36048459337;41242;41423.37864931968;42124;42154.578454216295;42205.36691949562;35520.46719299161;37262.813685931396;37654.43518347172;37671.434928475544;38225;28561.857190713912;28938.565921510773;28966.27584310409;29197.85401072981;29302.853485732434 18:57:28 INFO - PROCESS | 3412 | |2;jquery.html;373.5032406898823;387.82741679952426;389.5010862969996;392.55052964355815;414.1303263147389;13639.727205455885;15476.458323958665;18223.453296401098;20006.59986800265;20054.197832086735;16131.758023629625;19293.228270869182;19446.1249243784;19605.01974901253;19677.704834427495;5580.218769372291;5834.124881267822;5970.253718285215;6003.30961939376;6007.6996150192535;5768.3654797972185;5917.852053698649;5918.822435326947;5921.111833225029;5926.496247818941;5838.9124163137585;5840.766369345221;5871.88256234875;5882.5588080893895;6037.788677396292;6028.3067447243475;6062;6069.848253793669;6468.385503377219;6650.7339706411685;5770.278715160605;5887.8233652990475;5894.115882617642;5899.646021238696;5903.380145084747;13045.673858153526;15919.363225471083;21424.357269281947;23076.884615576982;23177.652335214985;2277.2029789573517;2340.520193360357;2345.2612427085414;2349.48311371498;2967.1988563087843;10125.848112278321;10506.737331566696;10526.210534209888;10541.472926353728;10613.522391492324;1931.2275089963987;2002.4893652118762;2010.7386039814876;2019.0914088660015;2030.0763152765455;87124.56437717771;87493.56253218757;89062.5546872268;89863;90407;10817.513211905483;10883.83674244887;10966.287191332538;11171.553137874394;11509.48207330672;15527.301271442811;15571.766423503657;15594.766078508832;15611.453599123975;15648.687026259411;7914.525128492193;8003.31971782405;8172.101068882418;8275.379346548913;8280.378971577156;7718;7718;7750.883736743954;7919.762407127795;8007.479513831582;4577.8397756078375;4683.929741053887;4768.237082066853;4872.196087645499;4881.633877459205;1927.3254360973547;2022.048722982329;2031.238285642884;2042.1014753508705;2047.5904819036252;959.7936443664646;970.4322971061866;997.3317877022413;1040.70339953113;1095.9671209863716;18645.347412840485;19545.120469578902;19659;19898.60202795965;19946.800531994784;1002.4686915934566;1006.1246715357686;1018.3075508654186;1043.4730461117088;1094.9616763413242;10409.843852342221;10475.476226188812;11138.554457821758;11147.832782508107;11360;434967;449520;457233;462615;467734;88078;91413;99354.5032274834;100196;100934.49532752289;970.6990832841842;1008.3647302199568;1027.0551092994463;1031.504877658728;1036;14534.563963081124;17277.65444691124;17971.74197806141;18357.082145892386;18541;41806;42683.3597496044;42964.35553466638;43136.78431607822;43730.562694372646;57908.4209157903;62280;62501.37498624955;63526.36473635204;63660.36339636544;8436.45163064399;8735.257503112307;8773.29813614922;8806.383553151218;8981.416207946462;12134;12885.355732213538;13376.264305463294;14082.859171408154;14101.576952691436;11924.582639607572;12082.939585302369;12222.100645572042;12253.571125010581;12709.17390369623;10960.28758130719;11468.483918223534;11725.648230553097;11742.060635148997;12181.817272741093;12495.187812792139;12558.686032849251;12564.811527827273;12587.559435419716;12750.936245318713;8936.776580585278;8947.239484643618;8997.505137217517;9024.548772561477;9339.906600933904;10910.94544527304;12022.458989345325;12362.567310144103;12565.37173141321;12591.559295424617 18:57:28 INFO - PROCESS | 3412 | |3;mootools.html;1513.303880215101;1513.8561836625522;1677.9077150756711;1799.946001619951;1806.394857722663;7960.641771120299;8121.553314567696;8676.305895528358;8683.218510334069;8801.955990220056;9073.092690730924;9165.129312715282;9167.816643667122;9175.908240917588;9178.95410522948;2349.9647505287435;2385.165192182731;2391.151141344824;2393.6888204533475;2407.6508906208587;2312.6993490846166;2340.719113706358;2381.678473406094;2394.6408038794148;2396.7842894139526;2347.5539647467012;2357.5284943011466;2361.598528250193;2377.108584280895;2385.4751954569965;2283.862968221904;2293.8853057347064;2302.481941563143;2320.14154762738;2350.717913850332;2275.8862056897256;2280.4184932842186;2289.175896677195;2314.340412982309;2326.1858349577683;9149;9164.175224229852;9199.770005749842;9213.447193168431;9220.769480763034;5143.074246635604;5155.32980712505;5161;5266.815661451869;5278.340207474066;3356.8153751543655;3392.8642854286045;3508.14050557615;3521.683048525645;3525.3830579648716;1187.7208855918852;1228.8402507674034;1242.7763002659517;1244.6452760963082;1247.9188852724544;12892.097553171281;12897.355132243445;12899.09706320558;12916.935415322958;12994.675133121653;4338.349247612883;4448.399466072039;4600.378948841931;4613.861584152481;4652.837150699709;10718.517666705016;10784.191185661106;10789.514471848786;10832.512536935857;10875.510602022929;5233.764480598382;5237.476252374732;5272.630915835932;5275.63070585063;5336.546393556591;4318.913621727548;4671.11248862715;4805.6155507559315;4839.104765618372;4924.482929292372;3960.4653371795016;3965.464662270614;4095.89760255996;4107.260693075215;4128.442660240889;1226.558438961973;1265.7468506298776;1271.065766661503;1272;1283.3198404845448;911.3893691226893;1004.8442491413842;1035.7151783259665;1037.7768779712399;1048.2295512798087;5843.415658434123;5889.411058894162;5904.704764761745;5991.820245392645;6073.848153796102;476.0764117611891;477.8829186849244;480.8533397313783;490.7423602608588;500.6170279736005;3917.6278253565865;4155.10665206982;4169.937450938239;4260.062786187033;4265.488141422987;10996.340219586851;11322;11337.489812958436;11408;11424.028957538536;10933.18001149917;11158.1631377647;11193.048590869867;11299.887001130048;11339.886601134049;8529.57352132391;8553.486790792573;8601.956990215009;8624.310055195443;8626.137386261324;6198.690065496617;6294.28471772378;6298.842528936813;6317.336679648754;6317.9052314214405;10230.437325947145;10273.434961077213;10318.690439286833;10486.790264194826;10512.369257844553;10413.408042449417;10622.256442048982;10637.840432393676;10663.306885052447;10742.8388574173;7261;7748.3413909816045;8010.479318844489;8033.277005069572;8171.142030086993;8897.332700047393;8920.375573709778;8924;8964.506952117696;8984.05667404913;7762.61186940662;7762.7671169865;7791.883121753065;7810.726624568113;8090.83818323642;7779.494332868346;7864.803379915548;7935.682572697027;7963.562004089599;8008.799780005546;7286.781396558112;7295.671694773641;7334.229905859808;7397.075365579302;7400;5478.780848766005;5542.667439953616;5554.1113421853925;5638.154276858504;5751.9137212941005;5497.340319161566;5581.49766521015;5632.887342253214;5642.633228840113;5670.461306175906 18:57:28 INFO - PROCESS | 3412 | |4;prototype.html;306.17791230545987;319.23861590107595;320.66490517409306;324.40957457427464;325.51823301513764;5567.554595632349;5602.590885919063;5611.793464405152;5615.466530679589;5625.212470254162;5491.917621235684;5517.641353312032;5527.613067085305;5528.640638358504;5532.2531458253125;4083.6120568546016;4179.582041795811;4244;4283.571642835723;4294.141171765644;4266.695984168546;4282.635975942048;4291.828326866922;4309.762963037032;4312.417823593806;4216.915661686764;4264.083222107246;4274.059706864485;4281.7002809803325;4291.656667466611;3997.5202975642965;4222.303319952204;4235.9364609530885;4245.363195520666;4304.182205380967;3706.8887933362043;3708.9814550927344;3720.5163328767358;3723.646253605903;3731.9813400933094;5341.786328546854;5341.93161367728;5361.758720857571;5366.838994830161;5370.677759334452;4592.908141837144;4773.641976851715;4805.990741944196;4851.927221091686;4863.440704319013;5592.245046918695;5636.549076073945;5675.290588676416;5684.317881854163;5744.650007248293;4045.615666511677;4056.634902858757;4071.246819338432;4071.2671719090554;4078.6737061035046;5754.935336962633;5863.5016023638045;5873.823785286406;5929.169916211734;5959.599494118878;4146.419501269825;4149.958500414958;4161.812718427678;4163.333866581333;4177.5195852476745;4180.707350485498;4203.684723645739;4222.556631553704;4229.407882896397;4244.787760611957;4745.264484004916;4786.856394308176;4836.12949669063;4847.321375007431;4861.732604706775;5662;5668.773249070074;5695.430456954355;5716.685582293014;5719.8570035749435;1427.5217802036227;1452.3101526774697;1456.5484699742901;1459.5767227503904;1462.714770619719;890.6660097215253;940.5579377692474;953.537534295866;981.7447463659357;1004.6333088422673;5468.261784659099;5525.834224973257;5569.774649577086;5582.023145949443;5589;5846.473817356373;5860.531157507389;5910.222195568076;5912.76348946046;5928.584999050111;5403.270558474555;5550.917571073602;5566.972165139148;5588;5660.688662123623;3117.516784898344;3133.905982820519;3145.732612727898;3154.7854076180834;3166.1609673436556;6026.668533230714;6167.599106058092;6173.290071641729;6201.472874805692;6235.251769787564;5917.55618328627;5920.348761636216;5941.821745347646;5955.40445955401;6002.699865006733;6136.005798115631;6138.631682099089;6141.232345956755;6207.720652570555;6260.624362538262;5686;5813.447722466359;5818.9127163093435;5829.183914252093;5842.678652674143;5797.884042319214;5798.927198468297;5819.185314056121;5820;5842.591018628656;5977.970110149421;6059.121427392915;6115.3578874217565;6118.265808103056;6181.96909015452;4119.46446961905;4154.172164247721;4170.874873753793;4186.330187170038;4203.600657937491;5886.175935369138;5898.375223025712;5916.142159386951;5921.312425958581;5942.6731529766275;5512.269679031647;5607.299087614048;5653.886922261614;5690.971545142248;5773.653580785166;5648.15277708347;5700.864524511585;5703.714814259188;5776.740046697824;5781.82654520365;5192.42883282831;5657.236273103078;5729.736753982237;5769.913451298318;5790.768369265183;5720.713964301852;5734.397888221677;5773.8556536086935;5801.332846722681;5818.592698511064;5648.4633959773755;5657.688827114548;5670.603057785916;5704.686242256716;5719.342275638189 18:57:28 INFO - PROCESS | 3412 | |5;yui.html;756.3608750605737;775.8138046868752;778.1401551285833;813.8413009463153;867.2931560777968;15558.222088895553;16704.83295167048;16757.497275081736;16875.40936067238;17601.207945642444;15566.37734490619;16000.199990000483;16015;16032.519024429286;16094.114823684693;659.0707102984792;798.1699033005667;802.3019972623825;835.8161204534993;836.1763662792144;841.6380956188837;842.9367797415188;844.5270648436864;845.2730651639584;847.1232274595794;879.9704345915262;881.343399167621;882.951437670931;883.0948278015054;883.4522595990495;866.5840396609663;878.0210065776677;878.5519385113606;879.6701237036111;880.1902249930048;637.6620391192675;637.7640273098937;637.7704026550438;638.0270088115615;640.826976716284;15593.454229101926;15662.373505059784;15683.372665093497;15707;15730.842691573167;13553.525626603021;13882.861171388258;14023.368948397347;14294.642633934234;16379.262933168036;13865.514706985206;13993.510227142104;14024.789628155586;14244.92877535616;14628.561143165722;4560.475545312298;4604.815807367701;4609.469910960249;4640.628749700016;4660.231061874787;86392.56803716005;86778;87354.56322718409;88335;89919.10080899173;11665.666251618346;11946;11959.521619135137;12074.517019319128;12164.635060948185;20429.387118386472;21627.35117946464;21628.243011494524;21643.13427462884;21813;8791.736247912573;8983.640654373752;9018.954905225432;9029.954850225839;9114.908850911406;4834.081524510332;4836.395450568679;4915.90168196634;4980.835282990706;5067.873303167376;3502.264524449843;3584.982075089608;3609.8556057757396;3621.3119507294055;3636;629.795316522123;636.7994081864198;638.3680156644888;643.1992169748693;649.5485637481904;733.4425836364402;784.4940013691137;796.2515235678444;817.7097130518699;824.7278398128603;9645.276604254708;9786.608535658494;10092.848607270897;10236.846447303296;10468.162546996222;606.2179788073336;606.8088552106072;615.1388056720627;623.9719212635442;690.0856365315976;5217.113090774577;5307.548858347083;5344.064788661969;5388.892222155535;5392.892142157135;121184.39407802904;127618;128481.35759321143;128801;129574;107400.46299768607;110852.4457377708;113175.43412283051;114754;115911;94217.528912355;95068;96079;98063.50968245255;99181;9796.951015244878;10218.131458825786;10235;10323.174146068446;10385.688429347132;57430.7128464355;57700.42299577119;57961;58311.70844145752;59910.40089599223;74678.2532174693;84448.57775711082;85587.5720621393;86662;87230;11674.883251167379;11689.181757277249;11884.46519906589;11989.460474278852;12868.678283042998;13216;14692.559223223321;14699.853001470276;14729.484468043567;14817.33322000491;12289.59482293011;12424.689382765504;12612.36938153107;12796.552120675731;12869.871301286867;12616.243025418504;12769.061299830139;12831.871681283441;13107.683746074666;13948.023638345625;12496.562620308245;12994.610161695164;13025.609231723063;13185;13832.170069795844;10905.291156074829;11192;11337.943310283395;11615.361155136548;11770.117241207116;11743.706407339885;11801.232919860182;11946.283223006647;12008.699782505508;12088.093392995737 18:57:28 INFO - PROCESS | 3412 | __end_tp_report 18:57:28 INFO - PROCESS | 3412 | __start_cc_report 18:57:28 INFO - PROCESS | 3412 | _x_x_mozilla_cycle_collect,325 18:57:28 INFO - PROCESS | 3412 | __end_cc_report 18:57:28 INFO - PROCESS | 3412 | __startTimestamp1470275848008__endTimestamp 18:57:28 INFO - PROCESS | 3412 | 18:57:28 INFO - PROCESS | 3412 | ------- Summary: start ------- 18:57:28 INFO - PROCESS | 3412 | Number of tests: 6 18:57:28 INFO - PROCESS | 3412 | 18:57:28 INFO - PROCESS | 3412 | [#0] dojo.html Cycles:165 Average:5387.03 Median:5634.75 stddev:633.90 (11.2%) stddev-sans-first:609.89 18:57:28 INFO - PROCESS | 3412 | Values: 3098.4 3114.7 3140.1 3143.5 3148.9 5333.6 5393.0 5437.6 5455.1 5470.8 5290.7 5355.6 5381.0 5415.9 5459.2 4845.6 4861.2 4951.0 4975.4 4984.9 4908.8 4965.6 5062.2 5070.3 5123.3 4827.2 4898.4 4904.7 4951.1 4988.3 4865.6 4889.4 4920.0 4937.5 4940.0 4843.0 4863.2 4863.3 4890.7 4974.1 5331.1 5375.2 5376.0 5392.3 5399.0 5734.1 5757.2 5776.2 5804.1 5822.9 5834.1 5857.0 5869.3 5875.8 5876.5 5400.1 5440.2 5465.3 5475.9 5482.9 5751.0 5850.7 5891.4 5933.6 6003.1 5697.9 5734.8 5740.9 5754.8 5760.9 5776.5 5839.5 5842.6 5848.2 5848.3 5576.5 5608.5 5654.1 5666.0 5746.0 5660.4 5662.8 5699.2 5711.4 5721.1 4265.0 4275.9 4281.2 4290.2 4320.0 3821.9 3848.7 3884.2 3894.2 3904.8 5554.8 5596.5 5604.0 5609.1 5625.0 5770.6 5787.1 5807.1 5832.5 5892.4 5472.6 5481.3 5485.5 5513.4 5600.2 4935.1 4940.4 4953.6 4957.1 4962.3 6033.5 6059.8 6071.7 6074.8 6096.0 5707.7 5775.2 5810.4 5830.8 5894.9 6130.9 6149.5 6160.8 6163.8 6166.3 5697.9 5709.5 5732.1 5739.0 5758.3 5644.6 5705.8 5810.4 5817.3 5834.2 5654.4 5689.9 5693.3 5695.8 5704.3 5550.5 5656.4 5665.4 5668.1 5675.3 5612.9 5633.7 5646.1 5701.4 5782.0 5723.4 5758.3 5768.9 5780.1 5782.0 5454.7 5630.7 5634.7 5640.5 5647.4 18:57:28 INFO - PROCESS | 3412 | 18:57:28 INFO - PROCESS | 3412 | [#1] ext.html Cycles:180 Average:57950.44 Median:42023.37 stddev:118366.05 (281.7%) stddev-sans-first:118619.63 18:57:28 INFO - PROCESS | 3412 | Values: 546.1 581.4 582.2 598.5 627.7 39009.6 42089.6 42216.8 42323.0 42359.8 43362.8 44020.0 44034.0 44109.1 44269.3 8743.7 8854.6 8855.6 8881.2 8898.6 8726.0 8814.2 8873.6 8875.7 8893.5 8890.1 8906.8 8914.7 8930.9 8940.3 8842.5 8850.0 8862.5 8862.8 8895.6 8682.1 8776.9 8797.6 8800.9 8822.6 35643.3 35825.1 36125.3 36133.8 36207.0 3832.0 4142.3 4210.9 4220.1 4427.5 32496.4 32554.8 32605.8 33187.3 34064.5 4129.9 4185.9 4223.6 4249.9 4316.0 246102.0 246310.0 246838.0 246844.0 247889.0 32621.2 56166.7 56224.7 56341.4 56387.4 34876.0 36683.4 36687.3 36747.0 36872.3 13240.1 13305.1 13402.7 13404.1 13420.7 11976.3 12113.8 12147.9 12153.9 12177.1 8419.3 8587.8 8616.5 8727.1 8748.4 3384.5 3454.4 3456.3 3504.6 3511.8 1037.1 1094.4 1157.0 1165.9 1183.1 33387.3 33539.5 33540.7 33632.0 33632.8 1145.1 1154.1 1231.7 1241.3 1246.5 16458.3 17361.7 17555.4 17555.6 17556.9 530213.3 530396.0 530403.0 532204.0 538767.0 58309.4 58578.7 58961.0 59182.7 59207.4 1328.3 1336.1 1379.1 1383.1 1390.7 30107.8 32265.0 33533.7 33569.7 34724.1 56886.4 57460.4 57505.0 57690.4 57769.1 493094.0 497326.0 497789.0 497792.0 498497.0 28550.0 29747.9 29755.6 30795.0 44549.8 48122.5 48255.3 48441.8 48617.5 49209.5 40301.4 42582.1 42824.8 42835.4 42844.6 40242.4 40806.2 41957.2 42581.1 42634.4 41242.0 41423.4 42124.0 42154.6 42205.4 35520.5 37262.8 37654.4 37671.4 38225.0 28561.9 28938.6 28966.3 29197.9 29302.9 18:57:28 INFO - PROCESS | 3412 | 18:57:28 INFO - PROCESS | 3412 | [#2] jquery.html Cycles:180 Average:28462.55 Median:11850.78 stddev:75464.85 (636.8%) stddev-sans-first:75647.07 18:57:28 INFO - PROCESS | 3412 | Values: 373.5 387.8 389.5 392.6 414.1 13639.7 15476.5 18223.5 20006.6 20054.2 16131.8 19293.2 19446.1 19605.0 19677.7 5580.2 5834.1 5970.3 6003.3 6007.7 5768.4 5917.9 5918.8 5921.1 5926.5 5838.9 5840.8 5871.9 5882.6 6037.8 6028.3 6062.0 6069.8 6468.4 6650.7 5770.3 5887.8 5894.1 5899.6 5903.4 13045.7 15919.4 21424.4 23076.9 23177.7 2277.2 2340.5 2345.3 2349.5 2967.2 10125.8 10506.7 10526.2 10541.5 10613.5 1931.2 2002.5 2010.7 2019.1 2030.1 87124.6 87493.6 89062.6 89863.0 90407.0 10817.5 10883.8 10966.3 11171.6 11509.5 15527.3 15571.8 15594.8 15611.5 15648.7 7914.5 8003.3 8172.1 8275.4 8280.4 7718.0 7718.0 7750.9 7919.8 8007.5 4577.8 4683.9 4768.2 4872.2 4881.6 1927.3 2022.0 2031.2 2042.1 2047.6 959.8 970.4 997.3 1040.7 1096.0 18645.3 19545.1 19659.0 19898.6 19946.8 1002.5 1006.1 1018.3 1043.5 1095.0 10409.8 10475.5 11138.6 11147.8 11360.0 434967.0 449520.0 457233.0 462615.0 467734.0 88078.0 91413.0 99354.5 100196.0 100934.5 970.7 1008.4 1027.1 1031.5 1036.0 14534.6 17277.7 17971.7 18357.1 18541.0 41806.0 42683.4 42964.4 43136.8 43730.6 57908.4 62280.0 62501.4 63526.4 63660.4 8436.5 8735.3 8773.3 8806.4 8981.4 12134.0 12885.4 13376.3 14082.9 14101.6 11924.6 12082.9 12222.1 12253.6 12709.2 10960.3 11468.5 11725.6 11742.1 12181.8 12495.2 12558.7 12564.8 12587.6 12750.9 8936.8 8947.2 8997.5 9024.5 9339.9 10910.9 12022.5 12362.6 12565.4 12591.6 18:57:28 INFO - PROCESS | 3412 | 18:57:28 INFO - PROCESS | 3412 | [#3] mootools.html Cycles:180 Average:5961.62 Median:4393.37 stddev:3447.56 (78.5%) stddev-sans-first:3441.02 18:57:28 INFO - PROCESS | 3412 | Values: 1513.3 1513.9 1677.9 1799.9 1806.4 7960.6 8121.6 8676.3 8683.2 8802.0 9073.1 9165.1 9167.8 9175.9 9179.0 2350.0 2385.2 2391.2 2393.7 2407.7 2312.7 2340.7 2381.7 2394.6 2396.8 2347.6 2357.5 2361.6 2377.1 2385.5 2283.9 2293.9 2302.5 2320.1 2350.7 2275.9 2280.4 2289.2 2314.3 2326.2 9149.0 9164.2 9199.8 9213.4 9220.8 5143.1 5155.3 5161.0 5266.8 5278.3 3356.8 3392.9 3508.1 3521.7 3525.4 1187.7 1228.8 1242.8 1244.6 1247.9 12892.1 12897.4 12899.1 12916.9 12994.7 4338.3 4448.4 4600.4 4613.9 4652.8 10718.5 10784.2 10789.5 10832.5 10875.5 5233.8 5237.5 5272.6 5275.6 5336.5 4318.9 4671.1 4805.6 4839.1 4924.5 3960.5 3965.5 4095.9 4107.3 4128.4 1226.6 1265.7 1271.1 1272.0 1283.3 911.4 1004.8 1035.7 1037.8 1048.2 5843.4 5889.4 5904.7 5991.8 6073.8 476.1 477.9 480.9 490.7 500.6 3917.6 4155.1 4169.9 4260.1 4265.5 10996.3 11322.0 11337.5 11408.0 11424.0 10933.2 11158.2 11193.0 11299.9 11339.9 8529.6 8553.5 8602.0 8624.3 8626.1 6198.7 6294.3 6298.8 6317.3 6317.9 10230.4 10273.4 10318.7 10486.8 10512.4 10413.4 10622.3 10637.8 10663.3 10742.8 7261.0 7748.3 8010.5 8033.3 8171.1 8897.3 8920.4 8924.0 8964.5 8984.1 7762.6 7762.8 7791.9 7810.7 8090.8 7779.5 7864.8 7935.7 7963.6 8008.8 7286.8 7295.7 7334.2 7397.1 7400.0 5478.8 5542.7 5554.1 5638.2 5751.9 5497.3 5581.5 5632.9 5642.6 5670.5 18:57:28 INFO - PROCESS | 3412 | 18:57:28 INFO - PROCESS | 3412 | [#4] prototype.html Cycles:180 Average:4828.43 Median:5585.01 stddev:1432.79 (25.7%) stddev-sans-first:1396.03 18:57:28 INFO - PROCESS | 3412 | Values: 306.2 319.2 320.7 324.4 325.5 5567.6 5602.6 5611.8 5615.5 5625.2 5491.9 5517.6 5527.6 5528.6 5532.3 4083.6 4179.6 4244.0 4283.6 4294.1 4266.7 4282.6 4291.8 4309.8 4312.4 4216.9 4264.1 4274.1 4281.7 4291.7 3997.5 4222.3 4235.9 4245.4 4304.2 3706.9 3709.0 3720.5 3723.6 3732.0 5341.8 5341.9 5361.8 5366.8 5370.7 4592.9 4773.6 4806.0 4851.9 4863.4 5592.2 5636.5 5675.3 5684.3 5744.7 4045.6 4056.6 4071.2 4071.3 4078.7 5754.9 5863.5 5873.8 5929.2 5959.6 4146.4 4150.0 4161.8 4163.3 4177.5 4180.7 4203.7 4222.6 4229.4 4244.8 4745.3 4786.9 4836.1 4847.3 4861.7 5662.0 5668.8 5695.4 5716.7 5719.9 1427.5 1452.3 1456.5 1459.6 1462.7 890.7 940.6 953.5 981.7 1004.6 5468.3 5525.8 5569.8 5582.0 5589.0 5846.5 5860.5 5910.2 5912.8 5928.6 5403.3 5550.9 5567.0 5588.0 5660.7 3117.5 3133.9 3145.7 3154.8 3166.2 6026.7 6167.6 6173.3 6201.5 6235.3 5917.6 5920.3 5941.8 5955.4 6002.7 6136.0 6138.6 6141.2 6207.7 6260.6 5686.0 5813.4 5818.9 5829.2 5842.7 5797.9 5798.9 5819.2 5820.0 5842.6 5978.0 6059.1 6115.4 6118.3 6182.0 4119.5 4154.2 4170.9 4186.3 4203.6 5886.2 5898.4 5916.1 5921.3 5942.7 5512.3 5607.3 5653.9 5691.0 5773.7 5648.2 5700.9 5703.7 5776.7 5781.8 5192.4 5657.2 5729.7 5769.9 5790.8 5720.7 5734.4 5773.9 5801.3 5818.6 5648.5 5657.7 5670.6 5704.7 5719.3 18:57:28 INFO - PROCESS | 3412 | 18:57:28 INFO - PROCESS | 3412 | [#5] yui.html Cycles:180 Average:22754.59 Median:3628.66 stddev:33809.67 (931.7%) stddev-sans-first:33864.16 18:57:28 INFO - PROCESS | 3412 | Values: 756.4 775.8 778.1 813.8 867.3 15558.2 16704.8 16757.5 16875.4 17601.2 15566.4 16000.2 16015.0 16032.5 16094.1 659.1 798.2 802.3 835.8 836.2 841.6 842.9 844.5 845.3 847.1 880.0 881.3 883.0 883.1 883.5 866.6 878.0 878.6 879.7 880.2 637.7 637.8 637.8 638.0 640.8 15593.5 15662.4 15683.4 15707.0 15730.8 13553.5 13882.9 14023.4 14294.6 16379.3 13865.5 13993.5 14024.8 14244.9 14628.6 4560.5 4604.8 4609.5 4640.6 4660.2 86392.6 86778.0 87354.6 88335.0 89919.1 11665.7 11946.0 11959.5 12074.5 12164.6 20429.4 21627.4 21628.2 21643.1 21813.0 8791.7 8983.6 9019.0 9030.0 9114.9 4834.1 4836.4 4915.9 4980.8 5067.9 3502.3 3585.0 3609.9 3621.3 3636.0 629.8 636.8 638.4 643.2 649.5 733.4 784.5 796.3 817.7 824.7 9645.3 9786.6 10092.8 10236.8 10468.2 606.2 606.8 615.1 624.0 690.1 5217.1 5307.5 5344.1 5388.9 5392.9 121184.4 127618.0 128481.4 128801.0 129574.0 107400.5 110852.4 113175.4 114754.0 115911.0 94217.5 95068.0 96079.0 98063.5 99181.0 9797.0 10218.1 10235.0 10323.2 10385.7 57430.7 57700.4 57961.0 58311.7 59910.4 74678.3 84448.6 85587.6 86662.0 87230.0 11674.9 11689.2 11884.5 11989.5 12868.7 13216.0 14692.6 14699.9 14729.5 14817.3 12289.6 12424.7 12612.4 12796.6 12869.9 12616.2 12769.1 12831.9 13107.7 13948.0 12496.6 12994.6 13025.6 13185.0 13832.2 10905.3 11192.0 11337.9 11615.4 11770.1 11743.7 11801.2 11946.3 12008.7 12088.1 18:57:28 INFO - PROCESS | 3412 | -------- Summary: end -------- 18:57:28 INFO - PROCESS | 3412 | 18:57:28 INFO - TEST-INFO | 3412: exit 0 18:57:28 INFO - TEST-OK | dromaeo_css | took 1113726ms 18:57:28 INFO - TEST-START | kraken 18:57:28 INFO - operating with platform_type : linux_ 18:57:28 INFO - Initialising browser for kraken test... 18:57:28 INFO - TEST-INFO | started process 3656 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpyURI8O/profile http://localhost:38950/getInfo.html) 18:57:32 INFO - PROCESS | 3656 | __metrics Screen width/height:1600/1200 18:57:32 INFO - PROCESS | 3656 | colorDepth:24 18:57:32 INFO - PROCESS | 3656 | Browser inner width/height: 1024/697 18:57:32 INFO - PROCESS | 3656 | __metrics 18:57:33 ERROR - PROCESS | 3656 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 18:57:34 INFO - TEST-INFO | 3656: exit 0 18:57:34 INFO - Browser initialized. 18:57:34 INFO - Running cycle 1/1 for kraken test... 18:57:34 INFO - TEST-INFO | started process 3776 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpyURI8O/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:57:46 INFO - PROCESS | 3776 | RSS: Main: 163553280 18:57:46 INFO - PROCESS | 3776 | 18:57:48 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:38950/tests/kraken/driver.html?testName=audio-beat-detection) 18:57:49 INFO - PROCESS | 3776 | RSS: Main: 169684992 18:57:49 INFO - PROCESS | 3776 | 18:57:52 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:38950/tests/kraken/driver.html?testName=audio-dft) 18:57:52 INFO - PROCESS | 3776 | RSS: Main: 168775680 18:57:52 INFO - PROCESS | 3776 | 18:57:55 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:38950/tests/kraken/driver.html?testName=audio-fft) 18:57:56 INFO - PROCESS | 3776 | RSS: Main: 164438016 18:57:56 INFO - PROCESS | 3776 | 18:57:58 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:38950/tests/kraken/driver.html?testName=audio-oscillator) 18:57:59 INFO - PROCESS | 3776 | RSS: Main: 165957632 18:57:59 INFO - PROCESS | 3776 | 18:58:01 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:38950/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:58:01 INFO - PROCESS | 3776 | RSS: Main: 165974016 18:58:01 INFO - PROCESS | 3776 | 18:58:05 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:38950/tests/kraken/driver.html?testName=imaging-darkroom) 18:58:05 INFO - PROCESS | 3776 | RSS: Main: 166592512 18:58:05 INFO - PROCESS | 3776 | 18:58:09 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:38950/tests/kraken/driver.html?testName=imaging-desaturate) 18:58:09 INFO - PROCESS | 3776 | RSS: Main: 163749888 18:58:09 INFO - PROCESS | 3776 | 18:58:13 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:38950/tests/kraken/driver.html?testName=json-parse-financial) 18:58:13 INFO - PROCESS | 3776 | RSS: Main: 165445632 18:58:13 INFO - PROCESS | 3776 | 18:58:14 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:38950/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:58:15 INFO - PROCESS | 3776 | RSS: Main: 165556224 18:58:15 INFO - PROCESS | 3776 | 18:58:17 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:38950/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:58:18 INFO - PROCESS | 3776 | RSS: Main: 165830656 18:58:18 INFO - PROCESS | 3776 | 18:58:20 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:38950/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:58:21 INFO - PROCESS | 3776 | RSS: Main: 166072320 18:58:21 INFO - PROCESS | 3776 | 18:58:23 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:38950/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:58:24 INFO - PROCESS | 3776 | RSS: Main: 165990400 18:58:24 INFO - PROCESS | 3776 | 18:58:27 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:38950/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:58:27 INFO - PROCESS | 3776 | RSS: Main: 166572032 18:58:27 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | Cycle 1(1): loaded http://localhost:38950/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:38950/tests/kraken/driver.html?testName=ai-astar) 18:58:29 INFO - PROCESS | 3776 | RSS: Main: 167129088 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | __start_tp_report 18:58:29 INFO - PROCESS | 3776 | _x_x_mozilla_page_load 18:58:29 INFO - PROCESS | 3776 | _x_x_mozilla_page_load_details 18:58:29 INFO - PROCESS | 3776 | |i|pagename|runs| 18:58:29 INFO - PROCESS | 3776 | |0;ai-astar;103;112;109;110;112;113;113;112;111;110 18:58:29 INFO - PROCESS | 3776 | |1;audio-beat-detection;146;118;144;180;119;151;148;120;180;124 18:58:29 INFO - PROCESS | 3776 | |2;audio-dft;165;162;162;161;161;165;171;161;162;161 18:58:29 INFO - PROCESS | 3776 | |3;audio-fft;74;75;76;187;78;77;76;76;152;76 18:58:29 INFO - PROCESS | 3776 | |4;audio-oscillator;84;85;159;85;87;85;138;84;86;149 18:58:29 INFO - PROCESS | 3776 | |5;imaging-gaussian-blur;118;118;118;118;117;118;118;118;117;118 18:58:29 INFO - PROCESS | 3776 | |6;imaging-darkroom;146;146;147;147;147;146;147;148;147;149 18:58:29 INFO - PROCESS | 3776 | |7;imaging-desaturate;101;96;96;96;95;96;96;95;97;96 18:58:29 INFO - PROCESS | 3776 | |8;json-parse-financial;56;52;53;52;56;52;53;53;52;54 18:58:29 INFO - PROCESS | 3776 | |9;json-stringify-tinderbox;60;61;59;60;60;60;61;61;62;60 18:58:29 INFO - PROCESS | 3776 | |10;stanford-crypto-aes;77;77;76;77;75;80;77;76;87;75 18:58:29 INFO - PROCESS | 3776 | |11;stanford-crypto-ccm;133;120;124;131;127;121;126;132;160;121 18:58:29 INFO - PROCESS | 3776 | |12;stanford-crypto-pbkdf2;161;162;155;160;159;158;155;159;155;155 18:58:29 INFO - PROCESS | 3776 | |13;stanford-crypto-sha256-iterative;63;66;64;64;64;63;65;66;67;62 18:58:29 INFO - PROCESS | 3776 | __end_tp_report 18:58:29 INFO - PROCESS | 3776 | __start_cc_report 18:58:29 INFO - PROCESS | 3776 | _x_x_mozilla_cycle_collect,885 18:58:29 INFO - PROCESS | 3776 | __end_cc_report 18:58:29 INFO - PROCESS | 3776 | __startTimestamp1470275909702__endTimestamp 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | ------- Summary: start ------- 18:58:29 INFO - PROCESS | 3776 | Number of tests: 14 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#0] ai-astar Cycles:10 Average:110.50 Median:112.00 stddev:2.95 (2.6%) stddev-sans-first:1.41 18:58:29 INFO - PROCESS | 3776 | Values: 103.0 112.0 109.0 110.0 112.0 113.0 113.0 112.0 111.0 110.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#1] audio-beat-detection Cycles:10 Average:143.00 Median:147.00 stddev:23.40 (15.9%) stddev-sans-first:24.79 18:58:29 INFO - PROCESS | 3776 | Values: 146.0 118.0 144.0 180.0 119.0 151.0 148.0 120.0 180.0 124.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#2] audio-dft Cycles:10 Average:163.10 Median:162.00 stddev:3.18 (2.0%) stddev-sans-first:3.30 18:58:29 INFO - PROCESS | 3776 | Values: 165.0 162.0 162.0 161.0 161.0 165.0 171.0 161.0 162.0 161.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#3] audio-fft Cycles:10 Average:94.70 Median:76.00 stddev:40.29 (53.0%) stddev-sans-first:42.03 18:58:29 INFO - PROCESS | 3776 | Values: 74.0 75.0 76.0 187.0 78.0 77.0 76.0 76.0 152.0 76.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#4] audio-oscillator Cycles:10 Average:104.20 Median:85.00 stddev:31.09 (36.6%) stddev-sans-first:32.11 18:58:29 INFO - PROCESS | 3776 | Values: 84.0 85.0 159.0 85.0 87.0 85.0 138.0 84.0 86.0 149.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#5] imaging-gaussian-blur Cycles:10 Average:117.80 Median:118.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 18:58:29 INFO - PROCESS | 3776 | Values: 118.0 118.0 118.0 118.0 117.0 118.0 118.0 118.0 117.0 118.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#6] imaging-darkroom Cycles:10 Average:147.00 Median:147.00 stddev:0.94 (0.6%) stddev-sans-first:0.93 18:58:29 INFO - PROCESS | 3776 | Values: 146.0 146.0 147.0 147.0 147.0 146.0 147.0 148.0 147.0 149.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:1.71 (1.8%) stddev-sans-first:0.60 18:58:29 INFO - PROCESS | 3776 | Values: 101.0 96.0 96.0 96.0 95.0 96.0 96.0 95.0 97.0 96.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#8] json-parse-financial Cycles:10 Average:53.30 Median:53.00 stddev:1.57 (3.0%) stddev-sans-first:1.32 18:58:29 INFO - PROCESS | 3776 | Values: 56.0 52.0 53.0 52.0 56.0 52.0 53.0 53.0 52.0 54.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#9] json-stringify-tinderbox Cycles:10 Average:60.40 Median:60.50 stddev:0.84 (1.4%) stddev-sans-first:0.88 18:58:29 INFO - PROCESS | 3776 | Values: 60.0 61.0 59.0 60.0 60.0 60.0 61.0 61.0 62.0 60.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#10] stanford-crypto-aes Cycles:10 Average:77.70 Median:77.00 stddev:3.56 (4.6%) stddev-sans-first:3.77 18:58:29 INFO - PROCESS | 3776 | Values: 77.0 77.0 76.0 77.0 75.0 80.0 77.0 76.0 87.0 75.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#11] stanford-crypto-ccm Cycles:10 Average:129.50 Median:129.00 stddev:11.71 (9.1%) stddev-sans-first:12.35 18:58:29 INFO - PROCESS | 3776 | Values: 133.0 120.0 124.0 131.0 127.0 121.0 126.0 132.0 160.0 121.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:157.90 Median:159.00 stddev:2.73 (1.7%) stddev-sans-first:2.65 18:58:29 INFO - PROCESS | 3776 | Values: 161.0 162.0 155.0 160.0 159.0 158.0 155.0 159.0 155.0 155.0 18:58:29 INFO - PROCESS | 3776 | 18:58:29 INFO - PROCESS | 3776 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.40 Median:64.50 stddev:1.58 (2.4%) stddev-sans-first:1.59 18:58:29 INFO - PROCESS | 3776 | Values: 63.0 66.0 64.0 64.0 64.0 63.0 65.0 66.0 67.0 62.0 18:58:29 INFO - PROCESS | 3776 | -------- Summary: end -------- 18:58:29 INFO - PROCESS | 3776 | 18:58:30 INFO - TEST-INFO | 3776: exit 0 18:58:30 INFO - TEST-OK | kraken | took 61965ms 18:58:30 INFO - SUITE-END | took 1175s 18:58:30 INFO - Completed test suite (00:19:35) 18:58:30 INFO - javascript benchmark 18:58:30 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7318.222401371941, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3098.4267910436565, 3114.735247503962, 3140.0736782649115, 3143.497040473524, 3148.937021259575, 5333.626646134772, 5392.975334686407, 5437.564994800417, 5455.127179651252, 5470.8085217017415, 5290.709011004393, 5355.571554275658, 5381.0, 5415.9458405415935, 5459.153831156177, 4845.6123510119105, 4861.222204447289, 4951.0, 4975.353204083464, 4984.850454486353, 4908.779104940286, 4965.553100220979, 5062.164742817431, 5070.29015937769, 5123.333966584358, 4827.155247831615, 4898.387701537308, 4904.656674032819, 4951.059298733229, 4988.251762235657, 4865.56209941107, 4889.3888263967, 4920.0, 4937.456879743226, 4940.0, 4842.951570484285, 4863.2461968394955, 4863.319135321058, 4890.70655760652, 4974.10466116099, 5331.1470164773455, 5375.16684913839, 5376.032314183445, 5392.325959255093, 5399.028174928511, 5734.139879018139, 5757.222774925415, 5776.191333213354, 5804.071348584249, 5822.883542329129, 5834.124881267801, 5857.0335894577765, 5869.325027621835, 5875.794347197871, 5876.471117599436, 5400.081986062379, 5440.211169380417, 5465.262189604392, 5475.945240547583, 5482.91775623366, 5750.971245143831, 5850.707464626837, 5891.351951285355, 5933.614315069507, 6003.129546215774, 5697.886042279131, 5734.799282025109, 5740.856478587985, 5754.827355179351, 5760.884782304331, 5776.451237132465, 5839.474447299764, 5842.5618078644275, 5848.181254624356, 5848.298204215522, 5576.525995290364, 5608.46719561641, 5654.123610840326, 5666.0, 5746.0, 5660.433956604389, 5662.830115096472, 5699.173619825185, 5711.400302968212, 5721.084626459747, 4264.978675106605, 4275.850345237902, 4281.186574550826, 4290.184864875664, 4320.027993701455, 3821.923561528754, 3848.730588858753, 3884.2231553689376, 3894.1822217334675, 3904.7852368119457, 5554.805581804618, 5596.468335508121, 5604.047311956977, 5609.1305847593685, 5625.015622266087, 5770.6249093808765, 5787.102999035156, 5807.128930660435, 5832.475077242983, 5892.381299963527, 5472.644278121909, 5481.260029895913, 5485.533729633026, 5513.393526712059, 5600.159976003632, 4935.087008903364, 4940.431850337185, 4953.628477864103, 4957.082939656175, 4962.305277261186, 6033.456988871023, 6059.848503787441, 6071.696415179312, 6074.817755467343, 6096.0, 5707.714614269353, 5775.162601422686, 5810.448007439287, 5830.7959221427045, 5894.941050589439, 6130.938690613215, 6149.508039356931, 6160.784372546939, 6163.845903852261, 6166.321704612579, 5697.857553561194, 5709.457601527848, 5732.054211055296, 5738.971305143447, 5758.337791154071, 5644.6330988485615, 5705.800296989752, 5810.4189581041555, 5817.272840894888, 5834.15404766315, 5654.378018418053, 5689.943100569107, 5693.3168019837885, 5695.772169113189, 5704.286964129484, 5550.47270509301, 5656.37779844225, 5665.376808550974, 5668.149777533403, 5675.290588676416, 5612.85967850807, 5633.746481408429, 5646.096624540054, 5701.4298570142655, 5782.045962416322, 5723.427657234243, 5758.25142731459, 5768.884622307446, 5780.075187969905, 5782.045962416322, 5454.6727196366755, 5630.718464076862, 5634.74643641029, 5640.492355687844, 5647.3787883333625], "value": 5342.637122275061, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [546.071268823617, 581.4418158567775, 582.1616871704745, 598.5331441475649, 627.7300760672908, 39009.609903900986, 42089.57910420891, 42216.788916055455, 42323.0, 42359.78820105899, 43362.7831860841, 44020.0, 44034.0, 44109.11781764363, 44269.33595996063, 8743.737687869358, 8854.557272136399, 8855.645774169025, 8881.24509416697, 8898.644054237822, 8726.0, 8814.162654547808, 8873.645054197857, 8875.733727988138, 8893.466392016468, 8890.066543012988, 8906.777330566723, 8914.73255802327, 8930.910690893106, 8940.329475289347, 8842.5136617486, 8850.0, 8862.512561809099, 8862.822743545157, 8895.59969801354, 8682.13178682133, 8776.912230877737, 8797.648094076229, 8800.8679869802, 8822.647094116228, 35643.28713425743, 35825.104372390895, 36125.27749444996, 36133.81933090344, 36207.0, 3832.0, 4142.2543942090415, 4210.947263184204, 4220.07158425146, 4427.512973572937, 32496.350072998644, 32554.837225813957, 32605.83697081523, 33187.33625327504, 34064.48903266453, 4129.855455059059, 4185.937210941838, 4223.598758117974, 4249.936250956238, 4315.956840431587, 246102.0, 246309.9999999982, 246838.0, 246844.0, 247889.0, 32621.18447038843, 56166.719166403906, 56224.71887640617, 56341.436585633615, 56387.43612563822, 34876.0, 36683.4497482538, 36687.26625467476, 36747.0, 36872.26255474929, 13240.146379506878, 13305.068645194937, 13402.731945361233, 13404.128731632412, 13420.731585368434, 11976.28142311464, 12113.818292725617, 12147.93926030382, 12153.878461215274, 12177.086718496148, 8419.326453883674, 8587.828243435097, 8616.526091065052, 8727.083656216133, 8748.387612867038, 3384.4754063120254, 3454.360943225461, 3456.3087382523595, 3504.6144924058335, 3511.8068506232403, 1037.096927138694, 1094.414488248783, 1156.9595064172881, 1165.8717541070475, 1183.1303991566192, 33387.3322533548, 33539.4969075464, 33540.66459335375, 33632.0, 33632.83183584066, 1145.1068166829887, 1154.0940361815933, 1231.6612931443924, 1241.3420886929762, 1246.5387806511467, 16458.341666333214, 17361.7395739064, 17555.385561505285, 17555.648887022442, 17556.912215438842, 530213.3489332529, 530396.0, 530403.0, 532204.0, 538767.0, 58309.41690583125, 58578.70710646419, 58961.0, 59182.704086479294, 59207.40792592019, 1328.2760895312078, 1336.0981337597084, 1379.0622376783883, 1383.1286289637665, 1390.7288078824733, 30107.849460752557, 32265.0, 33533.66466335403, 33569.66430335665, 34724.13189670177, 56886.431135688115, 57460.42539574551, 57505.0, 57690.42309576851, 57769.13346299725, 493094.0, 497326.0, 497789.0, 497792.0, 498497.0, 28550.0, 29747.851260744425, 29755.553666694585, 30795.0, 44549.77725111353, 48122.518774811804, 48255.27617085817, 48441.75779121082, 48617.5138248613, 49209.507904920494, 40301.39547906725, 42582.14835703331, 42824.78587607042, 42835.357469638606, 42844.571554284055, 40242.39636405398, 40806.1838763229, 41957.16085678208, 42581.14837703291, 42634.36048459337, 41242.0, 41423.37864931968, 42124.0, 42154.578454216295, 42205.36691949562, 35520.46719299161, 37262.813685931396, 37654.43518347172, 37671.434928475544, 38225.0, 28561.857190713912, 28938.565921510773, 28966.27584310409, 29197.85401072981, 29302.853485732434], "value": 19000.656575402685, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [373.5032406898823, 387.82741679952426, 389.5010862969996, 392.55052964355815, 414.1303263147389, 13639.727205455885, 15476.458323958665, 18223.453296401098, 20006.59986800265, 20054.197832086735, 16131.758023629625, 19293.228270869182, 19446.1249243784, 19605.01974901253, 19677.704834427495, 5580.218769372291, 5834.124881267822, 5970.253718285215, 6003.30961939376, 6007.6996150192535, 5768.3654797972185, 5917.852053698649, 5918.822435326947, 5921.111833225029, 5926.496247818941, 5838.9124163137585, 5840.766369345221, 5871.88256234875, 5882.5588080893895, 6037.788677396292, 6028.3067447243475, 6062.0, 6069.848253793669, 6468.385503377219, 6650.7339706411685, 5770.278715160605, 5887.8233652990475, 5894.115882617642, 5899.646021238696, 5903.380145084747, 13045.673858153526, 15919.363225471083, 21424.357269281947, 23076.884615576982, 23177.652335214985, 2277.2029789573517, 2340.520193360357, 2345.2612427085414, 2349.48311371498, 2967.1988563087843, 10125.848112278321, 10506.737331566696, 10526.210534209888, 10541.472926353728, 10613.522391492324, 1931.2275089963987, 2002.4893652118762, 2010.7386039814876, 2019.0914088660015, 2030.0763152765455, 87124.56437717771, 87493.56253218757, 89062.5546872268, 89863.0, 90407.0, 10817.513211905483, 10883.83674244887, 10966.287191332538, 11171.553137874394, 11509.48207330672, 15527.301271442811, 15571.766423503657, 15594.766078508832, 15611.453599123975, 15648.687026259411, 7914.525128492193, 8003.31971782405, 8172.101068882418, 8275.379346548913, 8280.378971577156, 7718.0, 7718.0, 7750.883736743954, 7919.762407127795, 8007.479513831582, 4577.8397756078375, 4683.929741053887, 4768.237082066853, 4872.196087645499, 4881.633877459205, 1927.3254360973547, 2022.048722982329, 2031.238285642884, 2042.1014753508705, 2047.5904819036252, 959.7936443664646, 970.4322971061866, 997.3317877022413, 1040.70339953113, 1095.9671209863716, 18645.347412840485, 19545.120469578902, 19659.0, 19898.60202795965, 19946.800531994784, 1002.4686915934566, 1006.1246715357686, 1018.3075508654186, 1043.4730461117088, 1094.9616763413242, 10409.843852342221, 10475.476226188812, 11138.554457821758, 11147.832782508107, 11360.0, 434967.0, 449520.0, 457233.0, 462615.0, 467734.0, 88078.0, 91413.0, 99354.5032274834, 100196.0, 100934.49532752289, 970.6990832841842, 1008.3647302199568, 1027.0551092994463, 1031.504877658728, 1036.0, 14534.563963081124, 17277.65444691124, 17971.74197806141, 18357.082145892386, 18541.0, 41806.0, 42683.3597496044, 42964.35553466638, 43136.78431607822, 43730.562694372646, 57908.4209157903, 62280.0, 62501.37498624955, 63526.36473635204, 63660.36339636544, 8436.45163064399, 8735.257503112307, 8773.29813614922, 8806.383553151218, 8981.416207946462, 12134.0, 12885.355732213538, 13376.264305463294, 14082.859171408154, 14101.576952691436, 11924.582639607572, 12082.939585302369, 12222.100645572042, 12253.571125010581, 12709.17390369623, 10960.28758130719, 11468.483918223534, 11725.648230553097, 11742.060635148997, 12181.817272741093, 12495.187812792139, 12558.686032849251, 12564.811527827273, 12587.559435419716, 12750.936245318713, 8936.776580585278, 8947.239484643618, 8997.505137217517, 9024.548772561477, 9339.906600933904, 10910.94544527304, 12022.458989345325, 12362.567310144103, 12565.37173141321, 12591.559295424617], "value": 9362.545943156236, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1513.303880215101, 1513.8561836625522, 1677.9077150756711, 1799.946001619951, 1806.394857722663, 7960.641771120299, 8121.553314567696, 8676.305895528358, 8683.218510334069, 8801.955990220056, 9073.092690730924, 9165.129312715282, 9167.816643667122, 9175.908240917588, 9178.95410522948, 2349.9647505287435, 2385.165192182731, 2391.151141344824, 2393.6888204533475, 2407.6508906208587, 2312.6993490846166, 2340.719113706358, 2381.678473406094, 2394.6408038794148, 2396.7842894139526, 2347.5539647467012, 2357.5284943011466, 2361.598528250193, 2377.108584280895, 2385.4751954569965, 2283.862968221904, 2293.8853057347064, 2302.481941563143, 2320.14154762738, 2350.717913850332, 2275.8862056897256, 2280.4184932842186, 2289.175896677195, 2314.340412982309, 2326.1858349577683, 9149.0, 9164.175224229852, 9199.770005749842, 9213.447193168431, 9220.769480763034, 5143.074246635604, 5155.32980712505, 5161.0, 5266.815661451869, 5278.340207474066, 3356.8153751543655, 3392.8642854286045, 3508.14050557615, 3521.683048525645, 3525.3830579648716, 1187.7208855918852, 1228.8402507674034, 1242.7763002659517, 1244.6452760963082, 1247.9188852724544, 12892.097553171281, 12897.355132243445, 12899.09706320558, 12916.935415322958, 12994.675133121653, 4338.349247612883, 4448.399466072039, 4600.378948841931, 4613.861584152481, 4652.837150699709, 10718.517666705016, 10784.191185661106, 10789.514471848786, 10832.512536935857, 10875.510602022929, 5233.764480598382, 5237.476252374732, 5272.630915835932, 5275.63070585063, 5336.546393556591, 4318.913621727548, 4671.11248862715, 4805.6155507559315, 4839.104765618372, 4924.482929292372, 3960.4653371795016, 3965.464662270614, 4095.89760255996, 4107.260693075215, 4128.442660240889, 1226.558438961973, 1265.7468506298776, 1271.065766661503, 1272.0, 1283.3198404845448, 911.3893691226893, 1004.8442491413842, 1035.7151783259665, 1037.7768779712399, 1048.2295512798087, 5843.415658434123, 5889.411058894162, 5904.704764761745, 5991.820245392645, 6073.848153796102, 476.0764117611891, 477.8829186849244, 480.8533397313783, 490.7423602608588, 500.6170279736005, 3917.6278253565865, 4155.10665206982, 4169.937450938239, 4260.062786187033, 4265.488141422987, 10996.340219586851, 11322.0, 11337.489812958436, 11408.0, 11424.028957538536, 10933.18001149917, 11158.1631377647, 11193.048590869867, 11299.887001130048, 11339.886601134049, 8529.57352132391, 8553.486790792573, 8601.956990215009, 8624.310055195443, 8626.137386261324, 6198.690065496617, 6294.28471772378, 6298.842528936813, 6317.336679648754, 6317.9052314214405, 10230.437325947145, 10273.434961077213, 10318.690439286833, 10486.790264194826, 10512.369257844553, 10413.408042449417, 10622.256442048982, 10637.840432393676, 10663.306885052447, 10742.8388574173, 7261.0, 7748.3413909816045, 8010.479318844489, 8033.277005069572, 8171.142030086993, 8897.332700047393, 8920.375573709778, 8924.0, 8964.506952117696, 8984.05667404913, 7762.61186940662, 7762.7671169865, 7791.883121753065, 7810.726624568113, 8090.83818323642, 7779.494332868346, 7864.803379915548, 7935.682572697027, 7963.562004089599, 8008.799780005546, 7286.781396558112, 7295.671694773641, 7334.229905859808, 7397.075365579302, 7400.0, 5478.780848766005, 5542.667439953616, 5554.1113421853925, 5638.154276858504, 5751.9137212941005, 5497.340319161566, 5581.49766521015, 5632.887342253214, 5642.633228840113, 5670.461306175906], "value": 4680.9931769998675, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [306.17791230545987, 319.23861590107595, 320.66490517409306, 324.40957457427464, 325.51823301513764, 5567.554595632349, 5602.590885919063, 5611.793464405152, 5615.466530679589, 5625.212470254162, 5491.917621235684, 5517.641353312032, 5527.613067085305, 5528.640638358504, 5532.2531458253125, 4083.6120568546016, 4179.582041795811, 4244.0, 4283.571642835723, 4294.141171765644, 4266.695984168546, 4282.635975942048, 4291.828326866922, 4309.762963037032, 4312.417823593806, 4216.915661686764, 4264.083222107246, 4274.059706864485, 4281.7002809803325, 4291.656667466611, 3997.5202975642965, 4222.303319952204, 4235.9364609530885, 4245.363195520666, 4304.182205380967, 3706.8887933362043, 3708.9814550927344, 3720.5163328767358, 3723.646253605903, 3731.9813400933094, 5341.786328546854, 5341.93161367728, 5361.758720857571, 5366.838994830161, 5370.677759334452, 4592.908141837144, 4773.641976851715, 4805.990741944196, 4851.927221091686, 4863.440704319013, 5592.245046918695, 5636.549076073945, 5675.290588676416, 5684.317881854163, 5744.650007248293, 4045.615666511677, 4056.634902858757, 4071.246819338432, 4071.2671719090554, 4078.6737061035046, 5754.935336962633, 5863.5016023638045, 5873.823785286406, 5929.169916211734, 5959.599494118878, 4146.419501269825, 4149.958500414958, 4161.812718427678, 4163.333866581333, 4177.5195852476745, 4180.707350485498, 4203.684723645739, 4222.556631553704, 4229.407882896397, 4244.787760611957, 4745.264484004916, 4786.856394308176, 4836.12949669063, 4847.321375007431, 4861.732604706775, 5662.0, 5668.773249070074, 5695.430456954355, 5716.685582293014, 5719.8570035749435, 1427.5217802036227, 1452.3101526774697, 1456.5484699742901, 1459.5767227503904, 1462.714770619719, 890.6660097215253, 940.5579377692474, 953.537534295866, 981.7447463659357, 1004.6333088422673, 5468.261784659099, 5525.834224973257, 5569.774649577086, 5582.023145949443, 5589.0, 5846.473817356373, 5860.531157507389, 5910.222195568076, 5912.76348946046, 5928.584999050111, 5403.270558474555, 5550.917571073602, 5566.972165139148, 5588.0, 5660.688662123623, 3117.516784898344, 3133.905982820519, 3145.732612727898, 3154.7854076180834, 3166.1609673436556, 6026.668533230714, 6167.599106058092, 6173.290071641729, 6201.472874805692, 6235.251769787564, 5917.55618328627, 5920.348761636216, 5941.821745347646, 5955.40445955401, 6002.699865006733, 6136.005798115631, 6138.631682099089, 6141.232345956755, 6207.720652570555, 6260.624362538262, 5686.0, 5813.447722466359, 5818.9127163093435, 5829.183914252093, 5842.678652674143, 5797.884042319214, 5798.927198468297, 5819.185314056121, 5820.0, 5842.591018628656, 5977.970110149421, 6059.121427392915, 6115.3578874217565, 6118.265808103056, 6181.96909015452, 4119.46446961905, 4154.172164247721, 4170.874873753793, 4186.330187170038, 4203.600657937491, 5886.175935369138, 5898.375223025712, 5916.142159386951, 5921.312425958581, 5942.6731529766275, 5512.269679031647, 5607.299087614048, 5653.886922261614, 5690.971545142248, 5773.653580785166, 5648.15277708347, 5700.864524511585, 5703.714814259188, 5776.740046697824, 5781.82654520365, 5192.42883282831, 5657.236273103078, 5729.736753982237, 5769.913451298318, 5790.768369265183, 5720.713964301852, 5734.397888221677, 5773.8556536086935, 5801.332846722681, 5818.592698511064, 5648.4633959773755, 5657.688827114548, 5670.603057785916, 5704.686242256716, 5719.342275638189], "value": 4362.615737519032, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [756.3608750605737, 775.8138046868752, 778.1401551285833, 813.8413009463153, 867.2931560777968, 15558.222088895553, 16704.83295167048, 16757.497275081736, 16875.40936067238, 17601.207945642444, 15566.37734490619, 16000.199990000483, 16015.0, 16032.519024429286, 16094.114823684693, 659.0707102984792, 798.1699033005667, 802.3019972623825, 835.8161204534993, 836.1763662792144, 841.6380956188837, 842.9367797415188, 844.5270648436864, 845.2730651639584, 847.1232274595794, 879.9704345915262, 881.343399167621, 882.951437670931, 883.0948278015054, 883.4522595990495, 866.5840396609663, 878.0210065776677, 878.5519385113606, 879.6701237036111, 880.1902249930048, 637.6620391192675, 637.7640273098937, 637.7704026550438, 638.0270088115615, 640.826976716284, 15593.454229101926, 15662.373505059784, 15683.372665093497, 15707.0, 15730.842691573167, 13553.525626603021, 13882.861171388258, 14023.368948397347, 14294.642633934234, 16379.262933168036, 13865.514706985206, 13993.510227142104, 14024.789628155586, 14244.92877535616, 14628.561143165722, 4560.475545312298, 4604.815807367701, 4609.469910960249, 4640.628749700016, 4660.231061874787, 86392.56803716005, 86778.0, 87354.56322718409, 88335.0, 89919.10080899173, 11665.666251618346, 11946.0, 11959.521619135137, 12074.517019319128, 12164.635060948185, 20429.387118386472, 21627.35117946464, 21628.243011494524, 21643.13427462884, 21813.0, 8791.736247912573, 8983.640654373752, 9018.954905225432, 9029.954850225839, 9114.908850911406, 4834.081524510332, 4836.395450568679, 4915.90168196634, 4980.835282990706, 5067.873303167376, 3502.264524449843, 3584.982075089608, 3609.8556057757396, 3621.3119507294055, 3636.0, 629.795316522123, 636.7994081864198, 638.3680156644888, 643.1992169748693, 649.5485637481904, 733.4425836364402, 784.4940013691137, 796.2515235678444, 817.7097130518699, 824.7278398128603, 9645.276604254708, 9786.608535658494, 10092.848607270897, 10236.846447303296, 10468.162546996222, 606.2179788073336, 606.8088552106072, 615.1388056720627, 623.9719212635442, 690.0856365315976, 5217.113090774577, 5307.548858347083, 5344.064788661969, 5388.892222155535, 5392.892142157135, 121184.39407802904, 127618.0, 128481.35759321143, 128801.0, 129574.0, 107400.46299768607, 110852.4457377708, 113175.43412283051, 114754.0, 115911.0, 94217.528912355, 95068.0, 96079.0, 98063.50968245255, 99181.0, 9796.951015244878, 10218.131458825786, 10235.0, 10323.174146068446, 10385.688429347132, 57430.7128464355, 57700.42299577119, 57961.0, 58311.70844145752, 59910.40089599223, 74678.2532174693, 84448.57775711082, 85587.5720621393, 86662.0, 87230.0, 11674.883251167379, 11689.181757277249, 11884.46519906589, 11989.460474278852, 12868.678283042998, 13216.0, 14692.559223223321, 14699.853001470276, 14729.484468043567, 14817.33322000491, 12289.59482293011, 12424.689382765504, 12612.36938153107, 12796.552120675731, 12869.871301286867, 12616.243025418504, 12769.061299830139, 12831.871681283441, 13107.683746074666, 13948.023638345625, 12496.562620308245, 12994.610161695164, 13025.609231723063, 13185.0, 13832.170069795844, 10905.291156074829, 11192.0, 11337.943310283395, 11615.361155136548, 11770.117241207116, 11743.706407339885, 11801.232919860182, 11946.283223006647, 12008.699782505508, 12088.093392995737], "value": 7913.866943041457, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1519.9000000000003, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 112.0, 109.0, 110.0, 112.0, 113.0, 113.0, 112.0, 111.0, 110.0], "value": 110.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 118.0, 144.0, 180.0, 119.0, 151.0, 148.0, 120.0, 180.0, 124.0], "value": 143.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 162.0, 162.0, 161.0, 161.0, 165.0, 171.0, 161.0, 162.0, 161.0], "value": 163.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 75.0, 76.0, 187.0, 78.0, 77.0, 76.0, 76.0, 152.0, 76.0], "value": 94.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 159.0, 85.0, 87.0, 85.0, 138.0, 84.0, 86.0, 149.0], "value": 104.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 118.0, 118.0, 117.0, 118.0, 118.0, 118.0, 117.0, 118.0], "value": 117.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 147.0, 147.0, 147.0, 146.0, 147.0, 148.0, 147.0, 149.0], "value": 147.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 96.0, 96.0, 96.0, 95.0, 96.0, 96.0, 95.0, 97.0, 96.0], "value": 96.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 52.0, 53.0, 52.0, 56.0, 52.0, 53.0, 53.0, 52.0, 54.0], "value": 53.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 61.0, 59.0, 60.0, 60.0, 60.0, 61.0, 61.0, 62.0, 60.0], "value": 60.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 76.0, 77.0, 75.0, 80.0, 77.0, 76.0, 87.0, 75.0], "value": 77.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 120.0, 124.0, 131.0, 127.0, 121.0, 126.0, 132.0, 160.0, 121.0], "value": 129.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 162.0, 155.0, 160.0, 159.0, 158.0, 155.0, 159.0, 155.0, 155.0], "value": 157.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 66.0, 64.0, 64.0, 64.0, 63.0, 65.0, 66.0, 67.0, 62.0], "value": 64.4, "unit": "score"}]}]} 18:58:30 INFO - Return code: 0 18:58:30 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 18:58:31 ERROR - # TBPL SUCCESS # 18:58:31 INFO - Running post-action listener: _resource_record_post_action 18:58:31 INFO - [mozharness: 2016-08-04 01:58:31.002832Z] Finished run-tests step (success) 18:58:31 INFO - Running post-run listener: _resource_record_post_run 18:58:31 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 7901184; Write bytes: 426049536; Read time: 1764; Write time: 334304 18:58:31 INFO - TinderboxPrint: CPU usage
13.3% 18:58:31 INFO - TinderboxPrint: I/O read bytes / time
7,901,184 / 1,764 18:58:31 INFO - TinderboxPrint: I/O write bytes / time
426,049,536 / 334,304 18:58:31 INFO - TinderboxPrint: CPU idle
8,248.4 (86.6%) 18:58:31 INFO - TinderboxPrint: CPU user
1,213.6 (12.7%) 18:58:31 INFO - TinderboxPrint: Swap in / out
0 / 0 18:58:31 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 9121792; Read time: 0; Write time: 1252 18:58:31 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 5660672; Write bytes: 416567296; Read time: 1596; Write time: 333028 18:58:31 INFO - Running post-run listener: _upload_blobber_files 18:58:31 INFO - Blob upload gear active. 18:58:31 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 18:58:31 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 18:58:31 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'] 18:58:31 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 18:58:32 INFO - (blobuploader) - INFO - Open directory for files ... 18:58:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 18:58:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:58:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:58:32 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 18:58:32 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:58:32 INFO - (blobuploader) - INFO - Done attempting. 18:58:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 18:58:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:58:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:58:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 18:58:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:58:33 INFO - (blobuploader) - INFO - Done attempting. 18:58:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 18:58:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:58:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:58:39 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 18:58:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:58:39 INFO - (blobuploader) - INFO - Done attempting. 18:58:39 INFO - (blobuploader) - INFO - Iteration through files over. 18:58:39 INFO - Return code: 0 18:58:39 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 18:58:39 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 18:58:39 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0a16b7ddef9df330847dc52fbc10edf6d2a7caa032cf57e23b1047c7b39df9e3705127e577c6de4ac506ef7c2e84e4022c5728ec81cbd7d4f9c339a50fbe523f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/87cd962258cd8bc58fda0e236bcd4e229ad8dec99a09de0490d002cdb9407970b44480f9c715b4dc9059429a4ed573d0ae4e0014ca5f8fdbf2ffd79d1a6d5135", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/5c2ccff1e0464ae01f19ddb15b039240ca2b54146c83ced5cc31aa965d60c2ae0639417edbd2d4025f51a2bcaedf949dc08ad7f418dc04a3ce382b0cad736a45"} 18:58:39 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 18:58:39 INFO - Writing to file /builds/slave/test/properties/blobber_files 18:58:39 INFO - Contents: 18:58:39 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0a16b7ddef9df330847dc52fbc10edf6d2a7caa032cf57e23b1047c7b39df9e3705127e577c6de4ac506ef7c2e84e4022c5728ec81cbd7d4f9c339a50fbe523f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/87cd962258cd8bc58fda0e236bcd4e229ad8dec99a09de0490d002cdb9407970b44480f9c715b4dc9059429a4ed573d0ae4e0014ca5f8fdbf2ffd79d1a6d5135", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/5c2ccff1e0464ae01f19ddb15b039240ca2b54146c83ced5cc31aa965d60c2ae0639417edbd2d4025f51a2bcaedf949dc08ad7f418dc04a3ce382b0cad736a45"} 18:58:39 INFO - Running post-run listener: copy_logs_to_upload_dir 18:58:39 INFO - Copying logs to upload dir... 18:58:39 INFO - mkdir: /builds/slave/test/build/upload/logs 18:58:39 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.955829 ========= master_lag: 0.08 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2016-08-03 18:58:39.242189) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-03 18:58:39.245809) ========= 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=0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836 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/0a16b7ddef9df330847dc52fbc10edf6d2a7caa032cf57e23b1047c7b39df9e3705127e577c6de4ac506ef7c2e84e4022c5728ec81cbd7d4f9c339a50fbe523f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/87cd962258cd8bc58fda0e236bcd4e229ad8dec99a09de0490d002cdb9407970b44480f9c715b4dc9059429a4ed573d0ae4e0014ca5f8fdbf2ffd79d1a6d5135", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/5c2ccff1e0464ae01f19ddb15b039240ca2b54146c83ced5cc31aa965d60c2ae0639417edbd2d4025f51a2bcaedf949dc08ad7f418dc04a3ce382b0cad736a45"} build_url:https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011333 build_url: 'https://queue.taskcluster.net/v1/task/UOBjUJdOQNe6jbz96pb_KQ/artifacts/public/build/firefox-51.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/0a16b7ddef9df330847dc52fbc10edf6d2a7caa032cf57e23b1047c7b39df9e3705127e577c6de4ac506ef7c2e84e4022c5728ec81cbd7d4f9c339a50fbe523f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/87cd962258cd8bc58fda0e236bcd4e229ad8dec99a09de0490d002cdb9407970b44480f9c715b4dc9059429a4ed573d0ae4e0014ca5f8fdbf2ffd79d1a6d5135", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/5c2ccff1e0464ae01f19ddb15b039240ca2b54146c83ced5cc31aa965d60c2ae0639417edbd2d4025f51a2bcaedf949dc08ad7f418dc04a3ce382b0cad736a45"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-03 18:58:39.272696) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-03 18:58:39.273041) ========= 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=0333a256a5e4f052382dd180000001b1-1470274487.120156-1281981836 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004430 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-03 18:58:39.357763) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-03 18:58:39.358084) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-03 18:58:39.358480) ========= ========= Total master_lag: 0.24 =========