builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-008 starttime: 1469806797.64 results: success (0) buildid: 20160729080625 builduid: b0f4d93a9a08463787ef568d8a2928ef revision: 907d353fc1c3c9d83cc5d15f6f3476c61d8ecda0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:57.640390) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:57.640902) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:57.641212) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:57.711050) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:57.711401) ========= 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=32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-29 08:39:57-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 66.7M=0s 2016-07-29 08:39:57 (66.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.122776 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:57.848403) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:57.848890) ========= 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=32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023327 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:57.923223) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-29 08:39:57.923730) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 907d353fc1c3c9d83cc5d15f6f3476c61d8ecda0 --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 907d353fc1c3c9d83cc5d15f6f3476c61d8ecda0 --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=32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-29 08:39:58,121 truncating revision to first 12 chars 2016-07-29 08:39:58,121 Setting DEBUG logging. 2016-07-29 08:39:58,121 attempt 1/10 2016-07-29 08:39:58,121 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/907d353fc1c3?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-29 08:39:58,762 unpacking tar archive at: fx-team-907d353fc1c3/testing/mozharness/ program finished with exit code 0 elapsedTime=1.004273 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-29 08:39:58.946065) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:58.946372) ========= script_repo_revision: 907d353fc1c3c9d83cc5d15f6f3476c61d8ecda0 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:58.946819) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:58.947099) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-29 08:39:58.958076) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-07-29 08:39:58.958490) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:39:59 INFO - MultiFileLogger online at 20160729 08:39:59 in /builds/slave/test 08:39:59 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 08:39:59 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 08:39:59 INFO - {'append_to_log': False, 08:39:59 INFO - 'base_work_dir': '/builds/slave/test', 08:39:59 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 08:39:59 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 08:39:59 INFO - 'branch': 'Fx-Team-Non-PGO', 08:39:59 INFO - 'buildbot_json_path': 'buildprops.json', 08:39:59 INFO - 'config_files': ('talos/linux_config.py',), 08:39:59 INFO - 'default_actions': ('clobber', 08:39:59 INFO - 'read-buildbot-config', 08:39:59 INFO - 'download-and-extract', 08:39:59 INFO - 'populate-webroot', 08:39:59 INFO - 'create-virtualenv', 08:39:59 INFO - 'install', 08:39:59 INFO - 'run-tests'), 08:39:59 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:39:59 INFO - 'download_minidump_stackwalk': True, 08:39:59 INFO - 'download_symbols': 'ondemand', 08:39:59 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:39:59 INFO - 'tooltool.py': '/tools/tooltool.py', 08:39:59 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:39:59 INFO - '/tools/misc-python/virtualenv.py')}, 08:39:59 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:39:59 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:39:59 INFO - 'installer_path': 'installer.exe', 08:39:59 INFO - 'log_level': 'info', 08:39:59 INFO - 'log_name': 'talos', 08:39:59 INFO - 'log_to_console': True, 08:39:59 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:39:59 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:39:59 INFO - 'opt_config_files': (), 08:39:59 INFO - 'pip_index': False, 08:39:59 INFO - 'sps_profile': False, 08:39:59 INFO - 'sps_profile_interval': 0, 08:39:59 INFO - 'suite': 'dromaeojs', 08:39:59 INFO - 'system_bits': '32', 08:39:59 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:39:59 INFO - 'title': 'talos-linux64-ix-008', 08:39:59 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:39:59 INFO - 'use_talos_json': True, 08:39:59 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 08:39:59 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:39:59 INFO - 'work_dir': 'build'} 08:39:59 INFO - [mozharness: 2016-07-29 15:39:59.243605Z] Running clobber step. 08:39:59 INFO - Running pre-action listener: _resource_record_pre_action 08:39:59 INFO - Running main action method: clobber 08:39:59 INFO - rmtree: /builds/slave/test/build 08:39:59 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 08:40:00 INFO - Running post-action listener: _resource_record_post_action 08:40:00 INFO - [mozharness: 2016-07-29 15:40:00.233287Z] Finished clobber step (success) 08:40:00 INFO - [mozharness: 2016-07-29 15:40:00.233389Z] Running read-buildbot-config step. 08:40:00 INFO - Running pre-action listener: _resource_record_pre_action 08:40:00 INFO - Running main action method: read_buildbot_config 08:40:00 INFO - Using buildbot properties: 08:40:00 INFO - { 08:40:00 INFO - "project": "", 08:40:00 INFO - "product": "firefox", 08:40:00 INFO - "script_repo_revision": "production", 08:40:00 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 08:40:00 INFO - "repository": "", 08:40:00 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 08:40:00 INFO - "buildid": "20160729080625", 08:40:00 INFO - "pgo_build": "False", 08:40:00 INFO - "basedir": "/builds/slave/test", 08:40:00 INFO - "buildnumber": 1837, 08:40:00 INFO - "slavename": "talos-linux64-ix-008", 08:40:00 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 08:40:00 INFO - "platform": "ubuntu64_hw", 08:40:00 INFO - "scheduler": "tests-fx-team-linux64-talos", 08:40:00 INFO - "branch": "fx-team", 08:40:00 INFO - "repo_path": "integration/fx-team", 08:40:00 INFO - "revision": "907d353fc1c3c9d83cc5d15f6f3476c61d8ecda0", 08:40:00 INFO - "stage_platform": "linux64", 08:40:00 INFO - "builduid": "b0f4d93a9a08463787ef568d8a2928ef", 08:40:00 INFO - "slavebuilddir": "test" 08:40:00 INFO - } 08:40:00 INFO - Found installer url https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 08:40:00 INFO - Running post-action listener: _resource_record_post_action 08:40:00 INFO - [mozharness: 2016-07-29 15:40:00.235818Z] Finished read-buildbot-config step (success) 08:40:00 INFO - [mozharness: 2016-07-29 15:40:00.235908Z] Running download-and-extract step. 08:40:00 INFO - Running pre-action listener: _resource_record_pre_action 08:40:00 INFO - Running main action method: download_and_extract 08:40:00 INFO - mkdir: /builds/slave/test/build/tests 08:40:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:00 INFO - https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 08:40:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:40:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:40:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:40:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 08:40:05 INFO - Downloaded 1361 bytes. 08:40:05 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 08:40:05 INFO - Using the following test package requirements: 08:40:05 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 08:40:05 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:40:05 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 08:40:05 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:40:05 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 08:40:05 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:40:05 INFO - u'jsshell-linux-x86_64.zip'], 08:40:05 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:40:05 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 08:40:05 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 08:40:05 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:40:05 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 08:40:05 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:40:05 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 08:40:05 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:40:05 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 08:40:05 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 08:40:05 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 08:40:05 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:40:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:05 INFO - https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:40:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:40:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:40:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:40:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:40:08 INFO - Downloaded 20231869 bytes. 08:40:08 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 08:40:08 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 08:40:09 INFO - Return code: 0 08:40:09 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 08:40:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:09 INFO - https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:40:09 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:40:09 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:40:09 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 08:40:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 08:40:16 INFO - Downloaded 20231869 bytes. 08:40:16 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 08:40:16 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 08:40:17 INFO - Return code: 0 08:40: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')]} 08:40:17 INFO - https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 08:40:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 08:40:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 08:40:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 08:40:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 08:40:18 INFO - Downloaded 14413725 bytes. 08:40:18 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 08:40:18 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 08:40:19 INFO - Return code: 0 08:40:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:19 INFO - https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 08:40:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:40:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:40:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:40:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 08:40:20 INFO - Downloaded 55586626 bytes. 08:40:20 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:40:20 INFO - mkdir: /builds/slave/test/properties 08:40:20 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 08:40:20 INFO - Writing to file /builds/slave/test/properties/build_url 08:40:20 INFO - Contents: 08:40:20 INFO - build_url:https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 08:40:20 INFO - Running post-action listener: _resource_record_post_action 08:40:20 INFO - Running post-action listener: set_extra_try_arguments 08:40:20 INFO - [mozharness: 2016-07-29 15:40:20.940674Z] Finished download-and-extract step (success) 08:40:20 INFO - [mozharness: 2016-07-29 15:40:20.940907Z] Running populate-webroot step. 08:40:20 INFO - Running pre-action listener: _resource_record_pre_action 08:40:20 INFO - Running main action method: populate_webroot 08:40:20 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:40:20 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:40:20 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:40:20 INFO - '--tppagecycles', 08:40:20 INFO - '7'], 08:40:20 INFO - 'tests': ['tsvgm']}}, 08:40:20 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:40:20 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 08:40:20 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:40:20 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 08:40:20 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:40:20 INFO - 'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:40:20 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:40:20 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:40:20 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:40:20 INFO - 'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['damp', 'tps']}, 08:40:20 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:40:20 INFO - 'tests': ['damp', 'tps']}, 08:40:20 INFO - 'g3': {'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['dromaeo_dom']}, 08:40:20 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:40:20 INFO - 'g4': {'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['basic_compositor_video']}, 08:40:20 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 08:40:20 INFO - 'other': {'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['a11yr', 08:40:20 INFO - 'ts_paint', 08:40:20 INFO - 'tpaint', 08:40:20 INFO - 'sessionrestore', 08:40:20 INFO - 'sessionrestore_no_auto_restore', 08:40:20 INFO - 'tabpaint']}, 08:40:20 INFO - 'other-e10s': {'tests': ['a11yr', 08:40:20 INFO - 'ts_paint', 08:40:20 INFO - 'tpaint', 08:40:20 INFO - 'sessionrestore', 08:40:20 INFO - 'sessionrestore_no_auto_restore', 08:40:20 INFO - 'tabpaint']}, 08:40:20 INFO - 'other-e10s_l64': {'tests': ['a11yr', 08:40:20 INFO - 'ts_paint', 08:40:20 INFO - 'tpaint', 08:40:20 INFO - 'sessionrestore', 08:40:20 INFO - 'sessionrestore_no_auto_restore', 08:40:20 INFO - 'tabpaint']}, 08:40:20 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 08:40:20 INFO - 'ts_paint', 08:40:20 INFO - 'tpaint', 08:40:20 INFO - 'sessionrestore', 08:40:20 INFO - 'sessionrestore_no_auto_restore', 08:40:20 INFO - 'tabpaint']}, 08:40:20 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['a11yr', 08:40:20 INFO - 'ts_paint', 08:40:20 INFO - 'tpaint', 08:40:20 INFO - 'sessionrestore', 08:40:20 INFO - 'sessionrestore_no_auto_restore', 08:40:20 INFO - 'tabpaint']}, 08:40:20 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['a11yr', 08:40:20 INFO - 'ts_paint', 08:40:20 INFO - 'tpaint', 08:40:20 INFO - 'sessionrestore', 08:40:20 INFO - 'sessionrestore_no_auto_restore', 08:40:20 INFO - 'tabpaint']}, 08:40:20 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['tsvgx', 08:40:20 INFO - 'tsvgr_opacity', 08:40:20 INFO - 'tart', 08:40:20 INFO - 'tscrollx', 08:40:20 INFO - 'cart']}, 08:40:20 INFO - 'svgr-e10s': {'tests': ['tsvgx', 08:40:20 INFO - 'tsvgr_opacity', 08:40:20 INFO - 'tart', 08:40:20 INFO - 'tscrollx', 08:40:20 INFO - 'cart']}, 08:40:20 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:40:20 INFO - 'talos_options': ['--disable-e10s'], 08:40:20 INFO - 'tests': ['tp5o']}, 08:40:20 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:40:20 INFO - 'tests': ['tp5o']}, 08:40:20 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:40:20 INFO - 'talos_options': ['--disable-e10s', 08:40:20 INFO - '--xperf_path', 08:40:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:40:20 INFO - 'tests': ['tp5n']}, 08:40:20 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:40:20 INFO - 'talos_options': ['--xperf_path', 08:40:20 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:40:20 INFO - 'tests': ['tp5n']}}, 08:40:20 INFO - 'talos.zip': {'path': '', 08:40:20 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:40:20 INFO - Running post-action listener: _resource_record_post_action 08:40:20 INFO - [mozharness: 2016-07-29 15:40:20.959362Z] Finished populate-webroot step (success) 08:40:20 INFO - [mozharness: 2016-07-29 15:40:20.959451Z] Running create-virtualenv step. 08:40:20 INFO - Running pre-action listener: _resource_record_pre_action 08:40:20 INFO - Running main action method: create_virtualenv 08:40:20 INFO - Creating virtualenv /builds/slave/test/build/venv 08:40:20 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 08:40:20 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 08:40:21 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:40:21 INFO - Using real prefix '/usr' 08:40:21 INFO - New python executable in /builds/slave/test/build/venv/bin/python 08:40:21 INFO - Installing distribute.............................................................................................................................................................................................done. 08:40:23 INFO - Installing pip.................done. 08:40:23 INFO - Return code: 0 08:40:23 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 08:40: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')]} 08:40:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40: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')]} 08:40:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40: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', 'pip>=1.5'] in /builds/slave/test/build 08:40: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 pip>=1.5 08:40:23 INFO - Using env: {'DISPLAY': ':0', 08:40:23 INFO - 'HOME': '/home/cltbld', 08:40:23 INFO - 'LANG': 'en_US.UTF-8', 08:40:23 INFO - 'LANGUAGE': 'en_US:en', 08:40:23 INFO - 'LOGNAME': 'cltbld', 08:40:23 INFO - 'MAIL': '/var/mail/cltbld', 08:40:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:23 INFO - 'MOZ_NO_REMOTE': '1', 08:40:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:23 INFO - 'NO_EM_RESTART': '1', 08:40:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:23 INFO - 'PWD': '/builds/slave/test', 08:40:23 INFO - 'SHELL': '/bin/bash', 08:40:23 INFO - 'SHLVL': '1', 08:40:23 INFO - 'TERM': 'linux', 08:40:23 INFO - 'TMOUT': '86400', 08:40:23 INFO - 'USER': 'cltbld', 08:40:23 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:23 INFO - '_': '/tools/buildbot/bin/python'} 08:40:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:23 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 08:40:23 INFO - Cleaning up... 08:40:23 INFO - Return code: 0 08:40:23 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 08:40: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')]} 08:40:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40: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')]} 08:40:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40: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', '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 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40: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', 'psutil>=3.1.1'] in /builds/slave/test/build 08:40: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 psutil>=3.1.1 08:40:23 INFO - Using env: {'DISPLAY': ':0', 08:40:23 INFO - 'HOME': '/home/cltbld', 08:40:23 INFO - 'LANG': 'en_US.UTF-8', 08:40:23 INFO - 'LANGUAGE': 'en_US:en', 08:40:23 INFO - 'LOGNAME': 'cltbld', 08:40:23 INFO - 'MAIL': '/var/mail/cltbld', 08:40:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:23 INFO - 'MOZ_NO_REMOTE': '1', 08:40:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:23 INFO - 'NO_EM_RESTART': '1', 08:40:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:23 INFO - 'PWD': '/builds/slave/test', 08:40:23 INFO - 'SHELL': '/bin/bash', 08:40:23 INFO - 'SHLVL': '1', 08:40:23 INFO - 'TERM': 'linux', 08:40:23 INFO - 'TMOUT': '86400', 08:40:23 INFO - 'USER': 'cltbld', 08:40:23 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:23 INFO - '_': '/tools/buildbot/bin/python'} 08:40:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:24 INFO - Downloading/unpacking psutil>=3.1.1 08:40:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 08:40:26 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:40:26 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:40:26 INFO - Installing collected packages: psutil 08:40:26 INFO - Running setup.py install for psutil 08:40:26 INFO - building 'psutil._psutil_linux' extension 08:40:26 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 08:40:26 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 08:40:26 INFO - building 'psutil._psutil_posix' extension 08:40:26 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 08:40:26 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 08:40:26 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:40:26 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:40:26 INFO - Successfully installed psutil 08:40:26 INFO - Cleaning up... 08:40:26 INFO - Return code: 0 08:40:26 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 08:40: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')]} 08:40:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40: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')]} 08:40:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 08:40: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 mozsystemmonitor==0.3 08:40:26 INFO - Using env: {'DISPLAY': ':0', 08:40:26 INFO - 'HOME': '/home/cltbld', 08:40:26 INFO - 'LANG': 'en_US.UTF-8', 08:40:26 INFO - 'LANGUAGE': 'en_US:en', 08:40:26 INFO - 'LOGNAME': 'cltbld', 08:40:26 INFO - 'MAIL': '/var/mail/cltbld', 08:40:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:26 INFO - 'MOZ_NO_REMOTE': '1', 08:40:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:26 INFO - 'NO_EM_RESTART': '1', 08:40:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:26 INFO - 'PWD': '/builds/slave/test', 08:40:26 INFO - 'SHELL': '/bin/bash', 08:40:26 INFO - 'SHLVL': '1', 08:40:26 INFO - 'TERM': 'linux', 08:40:26 INFO - 'TMOUT': '86400', 08:40:26 INFO - 'USER': 'cltbld', 08:40:26 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:26 INFO - '_': '/tools/buildbot/bin/python'} 08:40:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:26 INFO - Downloading/unpacking mozsystemmonitor==0.3 08:40: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 08:40: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 08:40: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 08:40: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 08:40: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 08:40: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 08:40:28 INFO - Downloading mozsystemmonitor-0.3.tar.gz 08:40:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:40:28 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 08:40:28 INFO - Installing collected packages: mozsystemmonitor 08:40:28 INFO - Running setup.py install for mozsystemmonitor 08:40:28 INFO - Successfully installed mozsystemmonitor 08:40:28 INFO - Cleaning up... 08:40:28 INFO - Return code: 0 08:40:28 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 08:40:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:28 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 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40:28 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 08:40:28 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 08:40:28 INFO - Using env: {'DISPLAY': ':0', 08:40:28 INFO - 'HOME': '/home/cltbld', 08:40:28 INFO - 'LANG': 'en_US.UTF-8', 08:40:28 INFO - 'LANGUAGE': 'en_US:en', 08:40:28 INFO - 'LOGNAME': 'cltbld', 08:40:28 INFO - 'MAIL': '/var/mail/cltbld', 08:40:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:28 INFO - 'MOZ_NO_REMOTE': '1', 08:40:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:28 INFO - 'NO_EM_RESTART': '1', 08:40:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:28 INFO - 'PWD': '/builds/slave/test', 08:40:28 INFO - 'SHELL': '/bin/bash', 08:40:28 INFO - 'SHLVL': '1', 08:40:28 INFO - 'TERM': 'linux', 08:40:28 INFO - 'TMOUT': '86400', 08:40:28 INFO - 'USER': 'cltbld', 08:40:28 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:28 INFO - '_': '/tools/buildbot/bin/python'} 08:40:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:29 INFO - Downloading/unpacking jsonschema==2.5.1 08:40:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:29 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:29 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:29 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:29 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:30 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:40:30 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 08:40:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:31 INFO - Downloading functools32-3.2.3-2.tar.gz 08:40:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 08:40:31 INFO - warning: no files found matching '*.txt' 08:40:31 INFO - no previously-included directories found matching 'build' 08:40:31 INFO - no previously-included directories found matching 'dist' 08:40:31 INFO - no previously-included directories found matching '.git*' 08:40:31 INFO - Installing collected packages: jsonschema, functools32 08:40:31 INFO - Running setup.py install for functools32 08:40:31 INFO - warning: no files found matching '*.txt' 08:40:31 INFO - no previously-included directories found matching 'build' 08:40:31 INFO - no previously-included directories found matching 'dist' 08:40:31 INFO - no previously-included directories found matching '.git*' 08:40:31 INFO - Successfully installed jsonschema functools32 08:40:31 INFO - Cleaning up... 08:40:31 INFO - Return code: 0 08:40:31 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 08:40:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:31 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 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40:31 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 08:40:31 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 08:40:31 INFO - Using env: {'DISPLAY': ':0', 08:40:31 INFO - 'HOME': '/home/cltbld', 08:40:31 INFO - 'LANG': 'en_US.UTF-8', 08:40:31 INFO - 'LANGUAGE': 'en_US:en', 08:40:31 INFO - 'LOGNAME': 'cltbld', 08:40:31 INFO - 'MAIL': '/var/mail/cltbld', 08:40:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:31 INFO - 'MOZ_NO_REMOTE': '1', 08:40:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:31 INFO - 'NO_EM_RESTART': '1', 08:40:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:31 INFO - 'PWD': '/builds/slave/test', 08:40:31 INFO - 'SHELL': '/bin/bash', 08:40:31 INFO - 'SHLVL': '1', 08:40:31 INFO - 'TERM': 'linux', 08:40:31 INFO - 'TMOUT': '86400', 08:40:31 INFO - 'USER': 'cltbld', 08:40:31 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:31 INFO - '_': '/tools/buildbot/bin/python'} 08:40:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:31 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 08:40:31 INFO - Cleaning up... 08:40:31 INFO - Return code: 0 08:40:31 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 08:40:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:31 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 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 08:40:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 08:40:31 INFO - Using env: {'DISPLAY': ':0', 08:40:31 INFO - 'HOME': '/home/cltbld', 08:40:31 INFO - 'LANG': 'en_US.UTF-8', 08:40:31 INFO - 'LANGUAGE': 'en_US:en', 08:40:31 INFO - 'LOGNAME': 'cltbld', 08:40:31 INFO - 'MAIL': '/var/mail/cltbld', 08:40:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:31 INFO - 'MOZ_NO_REMOTE': '1', 08:40:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:31 INFO - 'NO_EM_RESTART': '1', 08:40:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:31 INFO - 'PWD': '/builds/slave/test', 08:40:31 INFO - 'SHELL': '/bin/bash', 08:40:31 INFO - 'SHLVL': '1', 08:40:31 INFO - 'TERM': 'linux', 08:40:31 INFO - 'TMOUT': '86400', 08:40:31 INFO - 'USER': 'cltbld', 08:40:31 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:31 INFO - '_': '/tools/buildbot/bin/python'} 08:40:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:31 INFO - Downloading/unpacking blobuploader==1.2.4 08:40:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:33 INFO - Downloading blobuploader-1.2.4.tar.gz 08:40:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:40:33 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:40:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 08:40:34 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:40: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 08:40: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 08:40: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 08:40: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 08:40: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 08:40: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 08:40:34 INFO - Downloading docopt-0.6.1.tar.gz 08:40:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 08:40:34 INFO - Installing collected packages: blobuploader, requests, docopt 08:40:34 INFO - Running setup.py install for blobuploader 08:40:34 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:40:34 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 08:40:34 INFO - Running setup.py install for requests 08:40:34 INFO - Running setup.py install for docopt 08:40:35 INFO - Successfully installed blobuploader requests docopt 08:40:35 INFO - Cleaning up... 08:40:35 INFO - Return code: 0 08:40:35 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:40:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:35 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 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:40:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:40:35 INFO - Using env: {'DISPLAY': ':0', 08:40:35 INFO - 'HOME': '/home/cltbld', 08:40:35 INFO - 'LANG': 'en_US.UTF-8', 08:40:35 INFO - 'LANGUAGE': 'en_US:en', 08:40:35 INFO - 'LOGNAME': 'cltbld', 08:40:35 INFO - 'MAIL': '/var/mail/cltbld', 08:40:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:35 INFO - 'MOZ_NO_REMOTE': '1', 08:40:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:35 INFO - 'NO_EM_RESTART': '1', 08:40:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:35 INFO - 'PWD': '/builds/slave/test', 08:40:35 INFO - 'SHELL': '/bin/bash', 08:40:35 INFO - 'SHLVL': '1', 08:40:35 INFO - 'TERM': 'linux', 08:40:35 INFO - 'TMOUT': '86400', 08:40:35 INFO - 'USER': 'cltbld', 08:40:35 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:35 INFO - '_': '/tools/buildbot/bin/python'} 08:40:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:40:35 INFO - Running setup.py (path:/tmp/pip-UxOokn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:40:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:40:35 INFO - Running setup.py (path:/tmp/pip-54DH9n-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:40:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:40:35 INFO - Running setup.py (path:/tmp/pip-8cvqIu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:40:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:40:35 INFO - Running setup.py (path:/tmp/pip-KLQZ5a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:40:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:40:35 INFO - Running setup.py (path:/tmp/pip-9P4IyG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:40:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:40:35 INFO - Running setup.py (path:/tmp/pip-4rtYew-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:40:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:40:35 INFO - Running setup.py (path:/tmp/pip-XM2nY1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:40:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:40:35 INFO - Running setup.py (path:/tmp/pip-61IK5W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:40:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:40:35 INFO - Running setup.py (path:/tmp/pip-_7eVIf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:40:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:40:36 INFO - Running setup.py (path:/tmp/pip-ijSmG0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:40:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:40:36 INFO - Running setup.py (path:/tmp/pip-cOhNYH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:40:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:40:36 INFO - Running setup.py (path:/tmp/pip-GgeWaS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:40:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:40:36 INFO - Running setup.py (path:/tmp/pip-rS0WNP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:40:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:40:36 INFO - Running setup.py (path:/tmp/pip-zoVZ18-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:40:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:40:36 INFO - Running setup.py (path:/tmp/pip-dCVBpO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:40:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:40:36 INFO - Running setup.py (path:/tmp/pip-cl5pXg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:40:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:40:36 INFO - Running setup.py (path:/tmp/pip-cDUN8W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:40:36 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:40:36 INFO - Running setup.py install for manifestparser 08:40:36 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 08:40:36 INFO - Running setup.py install for mozcrash 08:40:36 INFO - Running setup.py install for mozdebug 08:40:36 INFO - Running setup.py install for mozdevice 08:40:37 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Installing dm script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Running setup.py install for mozfile 08:40:37 INFO - Running setup.py install for mozhttpd 08:40:37 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Running setup.py install for mozinfo 08:40:37 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Running setup.py install for mozInstall 08:40:37 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Running setup.py install for mozleak 08:40:37 INFO - Running setup.py install for mozlog 08:40:37 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Running setup.py install for moznetwork 08:40:37 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Running setup.py install for mozprocess 08:40:37 INFO - Running setup.py install for mozprofile 08:40:37 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 08:40:37 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 08:40:38 INFO - Running setup.py install for mozrunner 08:40:38 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 08:40:38 INFO - Running setup.py install for mozscreenshot 08:40:38 INFO - Running setup.py install for moztest 08:40:38 INFO - Running setup.py install for mozversion 08:40:38 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 08:40:38 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:40:38 INFO - Cleaning up... 08:40:38 INFO - Return code: 0 08:40:38 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:40:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:38 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 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 08:40:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:40:38 INFO - Using env: {'DISPLAY': ':0', 08:40:38 INFO - 'HOME': '/home/cltbld', 08:40:38 INFO - 'LANG': 'en_US.UTF-8', 08:40:38 INFO - 'LANGUAGE': 'en_US:en', 08:40:38 INFO - 'LOGNAME': 'cltbld', 08:40:38 INFO - 'MAIL': '/var/mail/cltbld', 08:40:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:38 INFO - 'MOZ_NO_REMOTE': '1', 08:40:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:38 INFO - 'NO_EM_RESTART': '1', 08:40:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:38 INFO - 'PWD': '/builds/slave/test', 08:40:38 INFO - 'SHELL': '/bin/bash', 08:40:38 INFO - 'SHLVL': '1', 08:40:38 INFO - 'TERM': 'linux', 08:40:38 INFO - 'TMOUT': '86400', 08:40:38 INFO - 'USER': 'cltbld', 08:40:38 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:38 INFO - '_': '/tools/buildbot/bin/python'} 08:40:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 08:40:38 INFO - Running setup.py (path:/tmp/pip-j6e_CV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 08:40:38 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 08:40:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 08:40:38 INFO - Running setup.py (path:/tmp/pip-AktnUu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 08:40:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:40:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 08:40:38 INFO - Running setup.py (path:/tmp/pip-ueIB3w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 08:40:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:40:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 08:40:38 INFO - Running setup.py (path:/tmp/pip-JZ9I9W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 08:40:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:40:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 08:40:38 INFO - Running setup.py (path:/tmp/pip-bYiQu6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 08:40:39 INFO - Running setup.py (path:/tmp/pip-xNygVG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 08:40:39 INFO - Running setup.py (path:/tmp/pip-9LYUuF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 08:40:39 INFO - Running setup.py (path:/tmp/pip-mpO9fe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 08:40:39 INFO - Running setup.py (path:/tmp/pip-wFRt1W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 08:40:39 INFO - Running setup.py (path:/tmp/pip-b1IAT5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 08:40:39 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)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 08:40:39 INFO - Running setup.py (path:/tmp/pip-_x8TM2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 08:40:39 INFO - Running setup.py (path:/tmp/pip-RSlmxX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 08:40:39 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)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 08:40:39 INFO - Running setup.py (path:/tmp/pip-mC2T0c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 08:40:39 INFO - Running setup.py (path:/tmp/pip-yAbSlf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 08:40:39 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)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 08:40:39 INFO - Running setup.py (path:/tmp/pip-LsuFxD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 08:40:39 INFO - Running setup.py (path:/tmp/pip-T_oWaw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 08:40:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 08:40:39 INFO - Running setup.py (path:/tmp/pip-SemDIG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:40:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 08:40:39 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 08:40:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:39 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:39 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:40:39 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:40:39 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:40:41 INFO - Downloading blessings-1.6.tar.gz 08:40:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 08:40:41 INFO - Installing collected packages: blessings 08:40:41 INFO - Running setup.py install for blessings 08:40:41 INFO - Successfully installed blessings 08:40:41 INFO - Cleaning up... 08:40:42 INFO - Return code: 0 08:40:42 INFO - Done creating virtualenv /builds/slave/test/build/venv. 08:40:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:40:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:40:42 INFO - Reading from file tmpfile_stdout 08:40:42 INFO - Current package versions: 08:40:42 INFO - argparse == 1.2.1 08:40:42 INFO - blessings == 1.6 08:40:42 INFO - blobuploader == 1.2.4 08:40:42 INFO - docopt == 0.6.1 08:40:42 INFO - functools32 == 3.2.3-2 08:40:42 INFO - jsonschema == 2.5.1 08:40:42 INFO - manifestparser == 1.1 08:40:42 INFO - mozInstall == 1.12 08:40:42 INFO - mozcrash == 0.17 08:40:42 INFO - mozdebug == 0.1 08:40:42 INFO - mozdevice == 0.48 08:40:42 INFO - mozfile == 1.2 08:40:42 INFO - mozhttpd == 0.7 08:40:42 INFO - mozinfo == 0.9 08:40:42 INFO - mozleak == 0.1 08:40:42 INFO - mozlog == 3.3 08:40:42 INFO - moznetwork == 0.27 08:40:42 INFO - mozprocess == 0.23 08:40:42 INFO - mozprofile == 0.28 08:40:42 INFO - mozrunner == 6.12 08:40:42 INFO - mozscreenshot == 0.1 08:40:42 INFO - mozsystemmonitor == 0.3 08:40:42 INFO - moztest == 0.7 08:40:42 INFO - mozversion == 1.4 08:40:42 INFO - psutil == 3.1.1 08:40:42 INFO - requests == 1.2.3 08:40:42 INFO - wsgiref == 0.1.2 08:40:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 08:40:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:42 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 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 08:40:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 08:40:42 INFO - Using env: {'DISPLAY': ':0', 08:40:42 INFO - 'HOME': '/home/cltbld', 08:40:42 INFO - 'LANG': 'en_US.UTF-8', 08:40:42 INFO - 'LANGUAGE': 'en_US:en', 08:40:42 INFO - 'LOGNAME': 'cltbld', 08:40:42 INFO - 'MAIL': '/var/mail/cltbld', 08:40:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:42 INFO - 'MOZ_NO_REMOTE': '1', 08:40:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:42 INFO - 'NO_EM_RESTART': '1', 08:40:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:42 INFO - 'PWD': '/builds/slave/test', 08:40:42 INFO - 'SHELL': '/bin/bash', 08:40:42 INFO - 'SHLVL': '1', 08:40:42 INFO - 'TERM': 'linux', 08:40:42 INFO - 'TMOUT': '86400', 08:40:42 INFO - 'USER': 'cltbld', 08:40:42 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:42 INFO - '_': '/tools/buildbot/bin/python'} 08:40:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 08:40:42 INFO - Cleaning up... 08:40:42 INFO - Return code: 0 08:40:42 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 08:40:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:40:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:40:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:40:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xaad030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc108a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd6e180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, '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': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 08:40:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 08:40:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 08:40:42 INFO - Using env: {'DISPLAY': ':0', 08:40:42 INFO - 'HOME': '/home/cltbld', 08:40:42 INFO - 'LANG': 'en_US.UTF-8', 08:40:42 INFO - 'LANGUAGE': 'en_US:en', 08:40:42 INFO - 'LOGNAME': 'cltbld', 08:40:42 INFO - 'MAIL': '/var/mail/cltbld', 08:40:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:42 INFO - 'MOZ_NO_REMOTE': '1', 08:40:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:42 INFO - 'NO_EM_RESTART': '1', 08:40:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:42 INFO - 'PWD': '/builds/slave/test', 08:40:42 INFO - 'SHELL': '/bin/bash', 08:40:42 INFO - 'SHLVL': '1', 08:40:42 INFO - 'TERM': 'linux', 08:40:42 INFO - 'TMOUT': '86400', 08:40:42 INFO - 'USER': 'cltbld', 08:40:42 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:42 INFO - '_': '/tools/buildbot/bin/python'} 08:40:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:40:42 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 08:40:42 INFO - Cleaning up... 08:40:42 INFO - Return code: 0 08:40:42 INFO - Running post-action listener: _resource_record_post_action 08:40:42 INFO - Running post-action listener: _start_resource_monitoring 08:40:42 INFO - Starting resource monitoring. 08:40:42 INFO - [mozharness: 2016-07-29 15:40:42.731494Z] Finished create-virtualenv step (success) 08:40:42 INFO - [mozharness: 2016-07-29 15:40:42.731923Z] Running install step. 08:40:42 INFO - Running pre-action listener: _resource_record_pre_action 08:40:42 INFO - Running main action method: install 08:40:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 08:40:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 08:40:42 INFO - Reading from file tmpfile_stdout 08:40:42 INFO - Detecting whether we're running mozinstall >=1.0... 08:40:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 08:40:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 08:40:43 INFO - Reading from file tmpfile_stdout 08:40:43 INFO - Output received: 08:40:43 INFO - Usage: mozinstall [options] installer 08:40:43 INFO - Options: 08:40:43 INFO - -h, --help show this help message and exit 08:40:43 INFO - -d DEST, --destination=DEST 08:40:43 INFO - Directory to install application into. [default: 08:40:43 INFO - "/builds/slave/test"] 08:40:43 INFO - --app=APP Application being installed. [default: firefox] 08:40:43 INFO - mkdir: /builds/slave/test/build/application 08:40:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 08:40:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 08:40:59 INFO - Reading from file tmpfile_stdout 08:40:59 INFO - Output received: 08:40:59 INFO - /builds/slave/test/build/application/firefox/firefox 08:40:59 INFO - Running post-action listener: _resource_record_post_action 08:40:59 INFO - [mozharness: 2016-07-29 15:40:59.037070Z] Finished install step (success) 08:40:59 INFO - [mozharness: 2016-07-29 15:40:59.037350Z] Running run-tests step. 08:40:59 INFO - Running pre-action listener: _resource_record_pre_action 08:40:59 INFO - Running main action method: run_tests 08:40:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 08:40:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 08:40:59 INFO - Python 2.7.3 08:40:59 INFO - Return code: 0 08:40:59 INFO - grabbing minidump binary from tooltool 08:40:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:40:59 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 0xd6c3b0>, '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 0xd6d2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd6d740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 08:40:59 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 08:40:59 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 08:40:59 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 08:40:59 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:40:59 INFO - Return code: 0 08:40:59 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 08:40:59 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 08:40:59 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 08:40:59 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 08:40:59 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 08:40:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-008', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 08:40:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-008 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 08:40:59 INFO - Using env: {'DISPLAY': ':0', 08:40:59 INFO - 'HOME': '/home/cltbld', 08:40:59 INFO - 'LANG': 'en_US.UTF-8', 08:40:59 INFO - 'LANGUAGE': 'en_US:en', 08:40:59 INFO - 'LOGNAME': 'cltbld', 08:40:59 INFO - 'MAIL': '/var/mail/cltbld', 08:40:59 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 08:40:59 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 08:40:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:40:59 INFO - 'MOZ_NO_REMOTE': '1', 08:40:59 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 08:40:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:40:59 INFO - 'NO_EM_RESTART': '1', 08:40:59 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:40:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 08:40:59 INFO - 'PWD': '/builds/slave/test', 08:40:59 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 08:40:59 INFO - 'SHELL': '/bin/bash', 08:40:59 INFO - 'SHLVL': '1', 08:40:59 INFO - 'TERM': 'linux', 08:40:59 INFO - 'TMOUT': '86400', 08:40:59 INFO - 'USER': 'cltbld', 08:40:59 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334', 08:40:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:40:59 INFO - '_': '/tools/buildbot/bin/python'} 08:40:59 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-008', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 08:40:59 INFO - mozversion application_buildid: 20160729080625 08:40:59 INFO - mozversion application_changeset: 907d353fc1c3c9d83cc5d15f6f3476c61d8ecda0 08:40:59 INFO - mozversion application_display_name: Nightly 08:40:59 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:40:59 INFO - mozversion application_name: Firefox 08:40:59 INFO - mozversion application_remotingname: firefox 08:40:59 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 08:40:59 INFO - mozversion application_vendor: Mozilla 08:40:59 INFO - mozversion application_version: 50.0a1 08:40:59 INFO - mozversion platform_buildid: 20160729080625 08:40:59 INFO - mozversion platform_changeset: 907d353fc1c3c9d83cc5d15f6f3476c61d8ecda0 08:40:59 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 08:40:59 INFO - mozversion platform_version: 50.0a1 08:40:59 INFO - using testdate: 1469806859 08:40:59 INFO - actual date: 1469806859 08:40:59 INFO - starting webserver on 'localhost:34509' 08:40:59 INFO - SUITE-START | Running 2 tests 08:40:59 INFO - TEST-START | dromaeo_css 08:40:59 INFO - operating with platform_type : linux_ 08:40:59 INFO - Initialising browser for dromaeo_css test... 08:40:59 INFO - TEST-INFO | started process 27285 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0u8Zwy/profile http://localhost:34509/getInfo.html) 08:41:03 INFO - PROCESS | 27285 | __metrics Screen width/height:1600/1200 08:41:03 INFO - PROCESS | 27285 | colorDepth:24 08:41:03 INFO - PROCESS | 27285 | Browser inner width/height: 1024/697 08:41:03 INFO - PROCESS | 27285 | __metrics 08:41:04 INFO - PROCESS | 27285 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:41:04 INFO - PROCESS | 27285 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 122: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:41:05 INFO - TEST-INFO | 27285: exit 0 08:41:05 INFO - Browser initialized. 08:41:05 INFO - Running cycle 1/1 for dromaeo_css test... 08:41:05 INFO - TEST-INFO | started process 27363 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp0u8Zwy/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:41:17 INFO - PROCESS | 27363 | RSS: Main: 157499392 08:41:17 INFO - PROCESS | 27363 | 08:42:08 INFO - PROCESS | 27363 | 1469806928590 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 08:44:21 INFO - PROCESS | 27363 | Cycle 1(1): loaded http://localhost:34509/tests/dromaeo/cssquery-dojo.html (next: http://localhost:34509/tests/dromaeo/cssquery-ext.html) 08:44:22 INFO - PROCESS | 27363 | RSS: Main: 273117184 08:44:22 INFO - PROCESS | 27363 | 08:47:25 INFO - PROCESS | 27363 | Cycle 1(1): loaded http://localhost:34509/tests/dromaeo/cssquery-ext.html (next: http://localhost:34509/tests/dromaeo/cssquery-jquery.html) 08:47:25 INFO - PROCESS | 27363 | RSS: Main: 237891584 08:47:25 INFO - PROCESS | 27363 | 08:50:28 INFO - PROCESS | 27363 | Cycle 1(1): loaded http://localhost:34509/tests/dromaeo/cssquery-jquery.html (next: http://localhost:34509/tests/dromaeo/cssquery-mootools.html) 08:50:28 INFO - PROCESS | 27363 | RSS: Main: 186847232 08:50:28 INFO - PROCESS | 27363 | 08:53:31 INFO - PROCESS | 27363 | Cycle 1(1): loaded http://localhost:34509/tests/dromaeo/cssquery-mootools.html (next: http://localhost:34509/tests/dromaeo/cssquery-prototype.html) 08:53:31 INFO - PROCESS | 27363 | RSS: Main: 186028032 08:53:31 INFO - PROCESS | 27363 | 08:56:34 INFO - PROCESS | 27363 | Cycle 1(1): loaded http://localhost:34509/tests/dromaeo/cssquery-prototype.html (next: http://localhost:34509/tests/dromaeo/cssquery-yui.html) 08:56:35 INFO - PROCESS | 27363 | RSS: Main: 185864192 08:56:35 INFO - PROCESS | 27363 | 08:59:38 INFO - PROCESS | 27363 | Cycle 1(1): loaded http://localhost:34509/tests/dromaeo/cssquery-yui.html (next: http://localhost:34509/tests/dromaeo/cssquery-dojo.html) 08:59:38 INFO - PROCESS | 27363 | RSS: Main: 275644416 08:59:38 INFO - PROCESS | 27363 | 08:59:38 INFO - PROCESS | 27363 | __start_tp_report 08:59:38 INFO - PROCESS | 27363 | _x_x_mozilla_page_load 08:59:38 INFO - PROCESS | 27363 | _x_x_mozilla_page_load_details 08:59:38 INFO - PROCESS | 27363 | |i|pagename|runs| 08:59:38 INFO - PROCESS | 27363 | |0;dojo.html;2651.482960822639;2653.1244689252526;2691.865406729664;2703.4998525272827;2706.2016705072015;4618.05329907369;4715.717056976575;4782.593479554238;4897.36334276544;4900.87747806305;4740.573348398643;4791.784369703363;4802.08760335536;4804.111239420701;4863.975680121604;4419.955800441987;4477.306017567283;4487.349334346518;4488.192125417424;4588.931166032496;4506.526814684444;4508.932366014513;4518.118966801475;4518.141553104916;4537.160625284317;4291.91416171678;4338.913221735579;4349.391085248036;4456.442944631921;4463.285874260103;4396.20868243716;4400.603945644907;4402.647788176938;4403.383526306319;4405.537418571068;4356.302991521373;4373.103513779667;4406.603405693503;4413.735175889425;4532.86401407955;4748;4840.636952228597;4851.539103785135;4887.9490909454635;4903.239997800347;5247.842564723064;5249.081410753103;5253.9737301313635;5257.290265814105;5258.0535503609335;4982.327385802906;5095.006473737622;5111.846644600668;5152;5272.868178295535;4810.735409552473;4819.325294458778;4861.052094841472;4863.294822250754;4866.9513304867205;5318.73406329682;5319.521243088141;5328.520433161034;5328.760205790749;5334.986352592995;4932.778024988884;4968.577670898014;5034.295198672189;5035.77339019745;5104.285400043997;5095.464976177522;5142.382914050338;5160.7935682573025;5188.45521220274;5194.376674798973;5068.847934561969;5075.187969924795;5094.2103973884105;5101.002036009389;5148.716820574904;4892.779824907888;4942.5057494251005;5021.372328458942;5022.121128802518;5070.467600901926;4293.4203882476095;4297.527272000078;4301;4339.34909763538;4339.609435150852;3751.7186211033736;3771.1891943232336;3812.4090765931323;3812.5424949006297;3819.102510909934;4291.463567054118;4333.8699839004885;4399.318105693623;4405.229084910128;4418.911621767611;5152.948470515247;5240.4759524047295;5246.6065045121;5246.790128394898;5262.184361423985;4481.820727170942;4486.955130448719;4488.910221795546;4497.100579884036;4525.796339164745;4472.798724057425;4577.473590537131;4689.20283551797;4691.976540117277;4719.95280047202;4813.855584332546;4834.782434790513;4842.709437433765;4876.390451193601;4890.828820991248;5148.76830542634;5158.638895277295;5160.638755287094;5162.045021671003;5210.14032684618;4660.184467718203;4765.451973023008;4782.760861956818;4845.103655823684;4891.192953162688;5090.669106508065;5136.229565565195;5142.460041695568;5155.664881782822;5179.922301165561;5164.9741751291;5194.168932970707;5202.869928251824;5211.374635043819;5253.474652534716;4843.830465933675;4896.36347274852;5055.418626857959;5056.241563765318;5068;4947.505249475168;5004.5746111579465;5015.147424937696;5026.170681837456;5039.244113383022;4893.486183950634;4903.656744027884;4940.752962351796;4944.060628480577;4945.18404463274;4830.7826147822725;4912.459629440687;5018.6198795331575;5035.370578677665;5037.395512538519;4871.244957031666;4899.951000489949;4900.803967841246;4916.680415772963;4939.357883475125 08:59:38 INFO - PROCESS | 27363 | |1;ext.html;546.2713055052316;583.8248525442369;584.6696616411728;591.9852003699908;593.7743657410183;26940.326491837688;38047.61952380479;38926.61073389265;38964.80517597415;42536;39218.80390598043;39772.80113599435;39849.80075099628;39878.80060599693;39983.200335993264;7435.702571897117;7772.766816995485;7957.801054973614;7965.044194696616;9632.325737198398;9703.805923881519;10197.082262596365;10200.438975856325;10201.489925503733;10205.234607404474;10209.2853500255;10243.487825608727;10262.179025677966;10262.435566043865;10262.58949642017;10216.438095904723;10266.281360304707;10270.229732770073;10272.97270272978;10275.845862312071;9768.853467197998;9821;9823.165030972375;9828.754281142958;9843.852342214872;37821.62178378236;38280;38298.42552361717;38312;38475.42286865699;2959.2306000439826;3047.238190452387;3290.835458227103;3653.9269214615824;3725.4411838224214;29179.85410072957;29265.41469170626;29289.85355073211;29674.406511869856;30150.396992060254;2834.376437183816;2840.758535524483;2850.1974173517688;2857.7142285771256;2872.8508596561333;245566;245732;245842;246114;246368;50533;50827.74586127046;50921.23618145731;50923.23615145776;50943;32760.83619581887;33560.32879342448;33598.83200583982;35352;53876.73061634745;14428.639284017983;14502.927485362507;14505.927470362582;14512;14514.20171890535;10133.594656213669;10847.511861966073;11739.765204695857;11830.822537661941;11851.288922664668;17854.464366069038;17865.910670446563;17883.910580447013;18115.36596219126;18125.818741812676;6599.8020059398295;6800.183977922681;6815.761448349284;6889.138857642794;7005.443013300109;781.183663072091;861.2894362151251;910.5902343945252;913.1598928985217;943.4433684126399;27536;28057.43885122286;28506.00228992017;28547.031460216636;28697.856510717313;945.0879900895669;973.2019743810149;1048.2033654422542;1059.1209296284067;1088.5210507376728;14202.360893759806;14973.925130374279;15030.248487575578;15192.92444373612;15290.847091528942;118616.40691796486;119668.40165799115;119895;120092.3995380035;121153.39423302827;48263.27605085926;48715;48770;48937.755311223926;48949.265761013616;1075.1130317488103;1120.882307357732;1153.9076873849904;1161.1581603337513;1166.877477864829;25623.871880640476;29071.7092829069;29113.708862911946;29720.554191687574;29768;41214;41659.16681666289;41728;41786.1642767149;41809.79095104627;318471;322287;322339;322950;323553;24848.254552362734;25213.87393063023;25613;25624.743752562983;27045.188644340702;41003.564875229225;41166.79416602898;41642;42139;42568;35648.465273021444;35715.64284357227;35983.64016359803;36409.27181456303;36527.26945461129;35291.470627940085;35469.29061418809;36045.09887252735;36159.096022599646;36241.27517449584;34610.48084278688;35046;35490.821510855;35918.8204058978;36241.81879090693;30759.846200768854;33140;33179.17052073718;33262.50106248457;33324.66675333216;24882.502349952538;25300.62049069302;25430.745692542838;25462.23613291604;25463.490730184923 08:59:38 INFO - PROCESS | 27363 | |2;jquery.html;352.56458274031553;373.10827123175613;377.56014243406435;386.576698515126;394.68819632490334;12762.234265944038;16089.67820643588;16476.176191190436;17748.556286092855;17880.642387152282;17408.47774566762;17418.129093545336;17606.82393176068;17666.116694165306;17824.197911094;5118.385793704751;5338.3060202173665;5600.243967064455;5639.68981706006;5705.286839145107;3556.822158892058;5114.156164232897;5643.746031428575;5684.204211410406;5686.715664216773;5407.567394608422;5435.918461223065;5473.698946557938;5474.972625136868;5482.0406428874985;5217.921731174036;5395.163749618815;5437.34751829779;5438.755256013469;5452.536534394581;5270.1040823060175;5282.815101471469;5284.418713941502;5285.101532739405;5291.894162116774;11814.763704725858;11846.111541634413;11879.22785018971;11931.463084161234;11979.640610781691;1692.6953148433277;1720.1227374039331;1735.7396390541394;1738.6261953679893;1956.7945365736678;8637.79070930064;9383.76540586484;9573.760655983657;13034.869651303461;13042.282674452901;1749.1429199692186;1757.5166829122093;1760.5070580237555;1762.2541012009074;1791.3192986665115;50206.999999999636;60812;64173.358266417206;66619.66690166615;67807.66096169487;8958.552072396355;9153.908460915438;10304.484775761182;10357.896421035693;10569.312994655324;14445.855541444662;14466;14467;14475.927620362041;14488.565343039725;7454.664540095709;7482.925170748332;7602.239776022354;7656.349210317074;7734.806629834186;7296.854062918712;7303.342699156995;7348;7470;7481.9251807482315;4111.876643700634;4266.869279640898;4350.260455722535;4470.776461176928;4665.720056796603;1634.8283430239892;1764.6206065695937;1779.6885545029568;1855.9536011599819;1858.9814101859079;743.5724458436421;814.6497006287235;846.7883029242689;902.5757893789909;946.2477330522252;15162;16395;17707.46877593674;17888.195031223626;18294.542636434195;810.3274282345639;820.729159377404;824.9298809601131;864.8270345930839;885.8626912828522;8132.75601731949;10145.797084058426;10157.238207134347;10185.541650625739;10203.693889183336;289525;289566;292278;379036;381493;82726.58636706778;83793;85681.57159214164;87016.56491717628;87999.56000219958;915.3135148638521;923.8290916180528;924.8751418558409;938.7324612485409;953.3612479638658;15145.545633631009;15243.085414875142;16361.427350042692;16492.34030638809;16714.247858846138;35655;38931.80534097425;39828.2034359317;40147.397789032606;40293.59706402898;45309.77345113253;54940.45059549353;55331;56272.71863640656;56412.71793641005;7552.735654252295;7594.848103038019;7768.883466748116;7912.84174316522;8071.798205044921;11408.885911140782;11667.124965627781;11946.283223006647;12001.079827227602;12803.679908002001;10314.329568578018;10475.58097676115;10564.260501764802;10644.680659580225;10818.891811081789;10346.32748871321;10471.790564188826;10637.734056648645;10773.299735517166;11055;10414.635487757892;10628.574857005942;10823;11042.779144417227;11106.333619982826;7325.157606875277;7350.228226036403;7361.595112268877;7461.4030877528585;7708.929043719627;5188.844334669966;10520.78958420812;10535.736606584896;10662.466876656292;10662.8933710665 08:59:38 INFO - PROCESS | 27363 | |3;mootools.html;1334.306160796386;1403.4035534897669;1423.267017485995;1652.917354132293;1693.5173475559461;7449.217832127623;7934.642941067651;7950.602469876505;7953.6420861061315;7958.641861116249;6454.870902581945;6611.867762644744;6619.801405957817;6772.255051944295;7783.532988020723;1866.0203393218567;2014.7783743788173;2090.383336915606;2095.486605781578;2097.423208617635;2109.7679255281905;2140.218820130649;2140.9036593353258;2158.1151727791607;2158.57907707997;2052.47661846229;2110.166484238725;2110.567333696596;2110.7783682713325;2113.7357830271217;2038.4088614301834;2057.68105943579;2065.6385132601736;2077.210659949225;2080.355089922129;2016.2439085342996;2020.7170996060563;2025.3620109665408;2034.52188735647;2034.9796502035085;7723.768286951345;7775.183605721431;7782.883256751154;7786.377089832799;7788;4610.2623580227;4613.1696294666945;4710.952890471086;4745.83389581363;4750.097481478542;2700.621912932191;2744.794140439475;2763.585462180669;2766.460540194663;2785.4150628368066;873.8164985353084;880.1527059961021;880.9119088091139;888.3337496877342;896.3143195455482;10065.547050382751;10243.94878025605;10264.922183170735;10430.739231519272;10431.791364172674;4019.91960160801;4203.684723645739;4287.464066991626;4348.152110338454;4348.673849461303;8992.8651070234;9001.144891235323;9013.459192448474;9026.819463610822;9038.186563209343;4674.228752255908;4680.251159814414;4691.085238378483;4708.858734237979;4710.740909249956;4214.7471151731;4257.680673949404;4260.467441569804;4261.4673165854265;4269.637080848101;3375.4093033719;3495.667911548399;3621.257642183346;3782.0544863784053;3798.4112462568346;1188.3820413385165;1211.618340222827;1226.0620625221713;1230.6369620961839;1230.772307123185;715.4312321704258;844.5523872347666;847.326375531454;860.8536548786722;876.5704804645678;5248.711320877312;5265.341832270966;5332.686346936564;5447.673139611636;5534.335879694382;815.9510429374138;817.3134566963779;835.6406745099665;882.6469412235028;942.8727121838601;3418.265073009315;3432.1248081738995;3585.30086633104;3585.7848529088337;3589.4795254688447;8892.688755893512;9320.8601870972;9321.347505674537;9338.972713001564;9413.717588472357;9011;9317.860232096524;9354.625814967325;9580.616775328908;9586.137247647745;7038.260982596856;7145.820939544917;7164.104486939133;7208.531445456028;7225.313595208447;5281.524662780368;5357.357117145967;5509.201165831012;5533.916991245054;5616.550675945996;8968.641254350014;9009.549522523717;9011.684591039282;9033.322500812334;9115.908840911507;8328.62521186536;8668.826623467621;8682.479051256945;9111.726648200565;9146.954265228898;6685.431738302104;6814.080099186546;6816.556923799937;6832.077669514552;6835.69239384219;6320.399562041599;7049.400800931979;7261.782146535613;7298.540291941739;7322.450816188701;6817.7272909083085;6945.201301850352;7030.824229394306;7111.9288807113335;7141.607211603412;6763.830904227434;6775.491838112062;6823.658817059227;6873.725050997904;6936.306369363023;6124.5712800103565;6223.439890409885;6226.906596400967;6235.220597425322;6235.314115447207;4587.620674585849;4719.764011799465;4804.0872234275375;4825.445073816556;4916.3362946001835;4491.685582009228;4515.729056256635;4573.405457290531;4625.190591646516;4761.023990081955 08:59:38 INFO - PROCESS | 27363 | |4;prototype.html;288.6723568749469;294.7612433928518;303.3235883978728;304.60097272572915;307.8937766470567;4898.240772680236;4955.801767929279;4963.305137280783;4965.131102057139;4978.527039931209;4565.383673204116;4719.716816990983;4722.268048452487;4736.71579705217;4874;3729.142297271629;3780.60303668115;3786.5456145262606;3796.9620303797024;3844.5578758442716;3833.5591406988133;3847.095932455885;3848.2880667076543;3859.0318937342017;3869.9806500967456;3653.5615726112906;3825.3496905526126;3835.871091544192;3859.6333348331864;3865.439511270864;3814.53140540891;3831.7509361891666;3833.5208098987628;3842.7502212356108;3866;3363.9159021024425;3365.814880181589;3372.4941258811127;3373.190434295776;3406.931861362759;4828.758562071883;4848.878778030577;4850.126977144113;4863.927041094386;4889.168841296988;4264.893377665552;4312.849050283225;4325.6367059756285;4330.653547716175;4339.652827773771;5111.821086261963;5125.846224613268;5127.461616530248;5128.333316668846;5135.6918584885025;3593.425051991695;3620.1130722972775;3622.855085796565;3629.5644522657185;3633.7100329383215;5206.401263854667;5304;5327.200919862013;5405.702686352289;5437.809676661337;3700.278445703062;3704.944425833615;3710.703143748494;3726.720495962814;3736.1033351995325;3772.5095737553943;3783.1487915218854;3785.2051069275763;3788.3559794834946;3802.6387493188104;4348.412964249786;4352.73883566987;4356.934645980313;4357.869263922087;4374.825006999748;4877.561019508261;5108.157154069611;5115.718635475085;5116.258142569307;5125.923111153335;1276.6403779974298;1295.6048405236493;1297.4096785962365;1297.5199176304827;1305.5300091966885;815.6370415165313;874.2437791310598;892.8392889279862;904.4844438669895;912.397817440486;4531.776420366483;4534.569215924482;4547.658925580595;4550.862284428893;4551.977240113778;5220.869478262998;5250.684958902478;5298.15229563268;5312;5318.361796584357;4365.607095361433;4532.138893610269;4569.405977223007;4572.291294849304;4578.6264120763635;2780.4717103750627;2792.3437992071845;2795.1474800185733;2800.3279212988737;2808.396194818124;4864.975675121673;4880.82917097907;4901.725551356673;4928.260760885824;4931.284963680247;5092.388913330424;5285.2600635911;5290.603204759658;5292.364916210079;5320.255164277004;4871.561559459595;4878.390201224847;4884.682495637843;4893.559579637849;4899.363082799285;5206.245094461357;5206.869828254324;5224.555912747459;5247.927068807723;5255.316808814982;4967.577755890789;5075.467075956972;5088.745562721923;5111.846644600668;5137.537621614073;4802.399700037496;4851.466338702669;4869.561739443467;4915.459299476983;4921.31101645777;3668.3396988542318;3676.191237927652;3680.7607505512055;3688.1332886772125;3697.2975134724315;4995.486603644368;5134.614903882149;5176.974115129551;5181.222816577543;5257.318767428716;5029.64792464524;5038.445770965118;5044.344235249394;5052.343195384577;5059.797608095635;5038.722870242025;5042.84871453857;5071.072992263064;5077.669951453144;5088.498892826551;4757.21505951528;4934.284528743384;4996.375453068366;5047.4952504749235;5050.924236136388;4951.3810773653295;5032.672876263031;5134.12719837621;5182.429932707324;5184.403793563789;5061.215511595708;5064.797408103782;5069.822556210515;5073.873153171053;5077.517635824591 08:59:38 INFO - PROCESS | 27363 | |5;yui.html;594.1058706646496;594.267709626439;604.6916072802869;664.5613894829413;666.251090886423;11830.940845295772;12925.289109098996;13059.085863989525;13129.73740525189;13132.21206727597;11949.342786146759;12431.751364972717;12434.689132771662;12524.81212781809;12591;741.4439170622047;767.1829501580798;770.102830202813;770.3529035610086;770.9036370453694;636.1920361141348;749.5989645539637;773.2036002917005;778.2567647896245;781;809.4819315637997;812.4475356757403;812.569338250728;812.8821320908464;812.959352032399;806.5443024691031;808.1433680298873;808.1716240853114;808.3008197908825;808.4300568099476;481.52810245958807;565.203063680209;584.0596639410545;585.5491271720794;594.1177351632822;12300.384980751016;12338.938305308506;12392.81410778839;12411.255324680547;12431.75136497274;10784.676459706221;11084.61203857861;11112.44437778108;11439.084873210124;11496.367699776509;11375.601853935155;11404.315741055563;11435.828462573068;11541.422928853524;11624.558842642971;3968.3849003404516;3976.0855003349393;3976.1252524444576;4077.8368865245357;4086.427900093989;52113.73943130298;53045.46954530444;53353.46646533562;60174.39825601732;60416.39583604152;9350.158485736316;9409.858852117224;9657.46883921377;9666.130048295687;9727.951360243154;16827.579310517336;16876.831231687527;16896.40862569829;16898.15509224534;16958.321667133176;6018.789342372996;6138.907916381258;6165.599236049642;6384.6169229846355;6471;3398.337324221753;3415.8804441844914;3428.63999280072;3478.3912815257227;3513.0690367052753;2700.2709268497397;2799.1882354117483;2815.957760633592;2819.3938303264895;2825.788065895066;506.4935064935065;507.13280290702573;510.49206039990446;514.1721827857147;519.0423668331922;561.4750208554932;604.6674329118968;606.4693393280879;607.4893912698199;607.9969600152059;7632.656530456143;7898.131205567383;7974.162712915177;8134.145914678992;8202.220789025034;488.378583104091;519.7764961066778;523.8821265215296;530.9707966061826;548.6570893191755;3703.685186759156;3749.643783840531;3756.3050835595504;3781.640744129303;3869.5356557212754;90486.54756726306;92901;93068;93902.53048734713;94471;68972.65513672399;70122.29877701157;80860.59569702114;82296.17703822885;82826.58586707027;43135.35296970548;43270;43714.56285437169;44339.55660443419;72003;7914.802129946797;8145.022597288364;8160.97987751531;8208.384371172067;8371.83256334882;30337.544936826405;38559;39727.60272397239;43245;44129;39749.00627484336;47131.764341178074;59178.40821591729;59268;63848.36151638424;10777.191710621892;11079.778404431705;11325.773484530428;11429.657110286706;11932.940335298616;11238.269512481662;11384.361419664117;11409.657710268373;11632.376948922558;11908.225965312227;10949.945250274017;11027.83458248111;11371.658850234175;11645.59240426581;11655.358955257203;11397.943010285228;11539.423028848692;11661.008814250883;11954.103442241692;12072.275663460221;10470.738231544272;10703.946480267548;10830.620928267474;11038.724031899266;11277.7744445109;9861.211103111877;9953.303268771117;10123.190144788547;10266.691999240034;10299.845502317621;9308.174845171421;9928.404295742279;10151.474357056695;10241.180705543688;10313.381197128196 08:59:38 INFO - PROCESS | 27363 | __end_tp_report 08:59:38 INFO - PROCESS | 27363 | __start_cc_report 08:59:38 INFO - PROCESS | 27363 | _x_x_mozilla_cycle_collect,1105 08:59:38 INFO - PROCESS | 27363 | __end_cc_report 08:59:38 INFO - PROCESS | 27363 | __startTimestamp1469807978286__endTimestamp 08:59:38 INFO - PROCESS | 27363 | 08:59:38 INFO - PROCESS | 27363 | ------- Summary: start ------- 08:59:38 INFO - PROCESS | 27363 | Number of tests: 6 08:59:38 INFO - PROCESS | 27363 | 08:59:38 INFO - PROCESS | 27363 | [#0] dojo.html Cycles:165 Average:4754.59 Median:4887.95 stddev:504.39 (10.3%) stddev-sans-first:478.20 08:59:38 INFO - PROCESS | 27363 | Values: 2651.5 2653.1 2691.9 2703.5 2706.2 4618.1 4715.7 4782.6 4897.4 4900.9 4740.6 4791.8 4802.1 4804.1 4864.0 4420.0 4477.3 4487.3 4488.2 4588.9 4506.5 4508.9 4518.1 4518.1 4537.2 4291.9 4338.9 4349.4 4456.4 4463.3 4396.2 4400.6 4402.6 4403.4 4405.5 4356.3 4373.1 4406.6 4413.7 4532.9 4748.0 4840.6 4851.5 4887.9 4903.2 5247.8 5249.1 5254.0 5257.3 5258.1 4982.3 5095.0 5111.8 5152.0 5272.9 4810.7 4819.3 4861.1 4863.3 4867.0 5318.7 5319.5 5328.5 5328.8 5335.0 4932.8 4968.6 5034.3 5035.8 5104.3 5095.5 5142.4 5160.8 5188.5 5194.4 5068.8 5075.2 5094.2 5101.0 5148.7 4892.8 4942.5 5021.4 5022.1 5070.5 4293.4 4297.5 4301.0 4339.3 4339.6 3751.7 3771.2 3812.4 3812.5 3819.1 4291.5 4333.9 4399.3 4405.2 4418.9 5152.9 5240.5 5246.6 5246.8 5262.2 4481.8 4487.0 4488.9 4497.1 4525.8 4472.8 4577.5 4689.2 4692.0 4720.0 4813.9 4834.8 4842.7 4876.4 4890.8 5148.8 5158.6 5160.6 5162.0 5210.1 4660.2 4765.5 4782.8 4845.1 4891.2 5090.7 5136.2 5142.5 5155.7 5179.9 5165.0 5194.2 5202.9 5211.4 5253.5 4843.8 4896.4 5055.4 5056.2 5068.0 4947.5 5004.6 5015.1 5026.2 5039.2 4893.5 4903.7 4940.8 4944.1 4945.2 4830.8 4912.5 5018.6 5035.4 5037.4 4871.2 4900.0 4900.8 4916.7 4939.4 08:59:38 INFO - PROCESS | 27363 | 08:59:38 INFO - PROCESS | 27363 | [#1] ext.html Cycles:180 Average:39581.11 Median:178156.92 stddev:63991.71 (35.9%) stddev-sans-first:64104.10 08:59:38 INFO - PROCESS | 27363 | Values: 546.3 583.8 584.7 592.0 593.8 26940.3 38047.6 38926.6 38964.8 42536.0 39218.8 39772.8 39849.8 39878.8 39983.2 7435.7 7772.8 7957.8 7965.0 9632.3 9703.8 10197.1 10200.4 10201.5 10205.2 10209.3 10243.5 10262.2 10262.4 10262.6 10216.4 10266.3 10270.2 10273.0 10275.8 9768.9 9821.0 9823.2 9828.8 9843.9 37821.6 38280.0 38298.4 38312.0 38475.4 2959.2 3047.2 3290.8 3653.9 3725.4 29179.9 29265.4 29289.9 29674.4 30150.4 2834.4 2840.8 2850.2 2857.7 2872.9 245566.0 245732.0 245842.0 246114.0 246368.0 50533.0 50827.7 50921.2 50923.2 50943.0 32760.8 33560.3 33598.8 35352.0 53876.7 14428.6 14502.9 14505.9 14512.0 14514.2 10133.6 10847.5 11739.8 11830.8 11851.3 17854.5 17865.9 17883.9 18115.4 18125.8 6599.8 6800.2 6815.8 6889.1 7005.4 781.2 861.3 910.6 913.2 943.4 27536.0 28057.4 28506.0 28547.0 28697.9 945.1 973.2 1048.2 1059.1 1088.5 14202.4 14973.9 15030.2 15192.9 15290.8 118616.4 119668.4 119895.0 120092.4 121153.4 48263.3 48715.0 48770.0 48937.8 48949.3 1075.1 1120.9 1153.9 1161.2 1166.9 25623.9 29071.7 29113.7 29720.6 29768.0 41214.0 41659.2 41728.0 41786.2 41809.8 318471.0 322287.0 322339.0 322950.0 323553.0 24848.3 25213.9 25613.0 25624.7 27045.2 41003.6 41166.8 41642.0 42139.0 42568.0 35648.5 35715.6 35983.6 36409.3 36527.3 35291.5 35469.3 36045.1 36159.1 36241.3 34610.5 35046.0 35490.8 35918.8 36241.8 30759.8 33140.0 33179.2 33262.5 33324.7 24882.5 25300.6 25430.7 25462.2 25463.5 08:59:38 INFO - PROCESS | 27363 | 08:59:38 INFO - PROCESS | 27363 | [#2] jquery.html Cycles:180 Average:22585.42 Median:20111.45 stddev:55043.35 (273.7%) stddev-sans-first:55172.45 08:59:38 INFO - PROCESS | 27363 | Values: 352.6 373.1 377.6 386.6 394.7 12762.2 16089.7 16476.2 17748.6 17880.6 17408.5 17418.1 17606.8 17666.1 17824.2 5118.4 5338.3 5600.2 5639.7 5705.3 3556.8 5114.2 5643.7 5684.2 5686.7 5407.6 5435.9 5473.7 5475.0 5482.0 5217.9 5395.2 5437.3 5438.8 5452.5 5270.1 5282.8 5284.4 5285.1 5291.9 11814.8 11846.1 11879.2 11931.5 11979.6 1692.7 1720.1 1735.7 1738.6 1956.8 8637.8 9383.8 9573.8 13034.9 13042.3 1749.1 1757.5 1760.5 1762.3 1791.3 50207.0 60812.0 64173.4 66619.7 67807.7 8958.6 9153.9 10304.5 10357.9 10569.3 14445.9 14466.0 14467.0 14475.9 14488.6 7454.7 7482.9 7602.2 7656.3 7734.8 7296.9 7303.3 7348.0 7470.0 7481.9 4111.9 4266.9 4350.3 4470.8 4665.7 1634.8 1764.6 1779.7 1856.0 1859.0 743.6 814.6 846.8 902.6 946.2 15162.0 16395.0 17707.5 17888.2 18294.5 810.3 820.7 824.9 864.8 885.9 8132.8 10145.8 10157.2 10185.5 10203.7 289525.0 289566.0 292278.0 379036.0 381493.0 82726.6 83793.0 85681.6 87016.6 87999.6 915.3 923.8 924.9 938.7 953.4 15145.5 15243.1 16361.4 16492.3 16714.2 35655.0 38931.8 39828.2 40147.4 40293.6 45309.8 54940.5 55331.0 56272.7 56412.7 7552.7 7594.8 7768.9 7912.8 8071.8 11408.9 11667.1 11946.3 12001.1 12803.7 10314.3 10475.6 10564.3 10644.7 10818.9 10346.3 10471.8 10637.7 10773.3 11055.0 10414.6 10628.6 10823.0 11042.8 11106.3 7325.2 7350.2 7361.6 7461.4 7708.9 5188.8 10520.8 10535.7 10662.5 10662.9 08:59:38 INFO - PROCESS | 27363 | 08:59:38 INFO - PROCESS | 27363 | [#3] mootools.html Cycles:180 Average:5079.93 Median:5478.44 stddev:2819.05 (51.5%) stddev-sans-first:2812.90 08:59:38 INFO - PROCESS | 27363 | Values: 1334.3 1403.4 1423.3 1652.9 1693.5 7449.2 7934.6 7950.6 7953.6 7958.6 6454.9 6611.9 6619.8 6772.3 7783.5 1866.0 2014.8 2090.4 2095.5 2097.4 2109.8 2140.2 2140.9 2158.1 2158.6 2052.5 2110.2 2110.6 2110.8 2113.7 2038.4 2057.7 2065.6 2077.2 2080.4 2016.2 2020.7 2025.4 2034.5 2035.0 7723.8 7775.2 7782.9 7786.4 7788.0 4610.3 4613.2 4711.0 4745.8 4750.1 2700.6 2744.8 2763.6 2766.5 2785.4 873.8 880.2 880.9 888.3 896.3 10065.5 10243.9 10264.9 10430.7 10431.8 4019.9 4203.7 4287.5 4348.2 4348.7 8992.9 9001.1 9013.5 9026.8 9038.2 4674.2 4680.3 4691.1 4708.9 4710.7 4214.7 4257.7 4260.5 4261.5 4269.6 3375.4 3495.7 3621.3 3782.1 3798.4 1188.4 1211.6 1226.1 1230.6 1230.8 715.4 844.6 847.3 860.9 876.6 5248.7 5265.3 5332.7 5447.7 5534.3 816.0 817.3 835.6 882.6 942.9 3418.3 3432.1 3585.3 3585.8 3589.5 8892.7 9320.9 9321.3 9339.0 9413.7 9011.0 9317.9 9354.6 9580.6 9586.1 7038.3 7145.8 7164.1 7208.5 7225.3 5281.5 5357.4 5509.2 5533.9 5616.6 8968.6 9009.5 9011.7 9033.3 9115.9 8328.6 8668.8 8682.5 9111.7 9147.0 6685.4 6814.1 6816.6 6832.1 6835.7 6320.4 7049.4 7261.8 7298.5 7322.5 6817.7 6945.2 7030.8 7111.9 7141.6 6763.8 6775.5 6823.7 6873.7 6936.3 6124.6 6223.4 6226.9 6235.2 6235.3 4587.6 4719.8 4804.1 4825.4 4916.3 4491.7 4515.7 4573.4 4625.2 4761.0 08:59:38 INFO - PROCESS | 27363 | 08:59:38 INFO - PROCESS | 27363 | [#4] prototype.html Cycles:180 Average:4233.86 Median:4864.45 stddev:1221.42 (25.1%) stddev-sans-first:1188.41 08:59:38 INFO - PROCESS | 27363 | Values: 288.7 294.8 303.3 304.6 307.9 4898.2 4955.8 4963.3 4965.1 4978.5 4565.4 4719.7 4722.3 4736.7 4874.0 3729.1 3780.6 3786.5 3797.0 3844.6 3833.6 3847.1 3848.3 3859.0 3870.0 3653.6 3825.3 3835.9 3859.6 3865.4 3814.5 3831.8 3833.5 3842.8 3866.0 3363.9 3365.8 3372.5 3373.2 3406.9 4828.8 4848.9 4850.1 4863.9 4889.2 4264.9 4312.8 4325.6 4330.7 4339.7 5111.8 5125.8 5127.5 5128.3 5135.7 3593.4 3620.1 3622.9 3629.6 3633.7 5206.4 5304.0 5327.2 5405.7 5437.8 3700.3 3704.9 3710.7 3726.7 3736.1 3772.5 3783.1 3785.2 3788.4 3802.6 4348.4 4352.7 4356.9 4357.9 4374.8 4877.6 5108.2 5115.7 5116.3 5125.9 1276.6 1295.6 1297.4 1297.5 1305.5 815.6 874.2 892.8 904.5 912.4 4531.8 4534.6 4547.7 4550.9 4552.0 5220.9 5250.7 5298.2 5312.0 5318.4 4365.6 4532.1 4569.4 4572.3 4578.6 2780.5 2792.3 2795.1 2800.3 2808.4 4865.0 4880.8 4901.7 4928.3 4931.3 5092.4 5285.3 5290.6 5292.4 5320.3 4871.6 4878.4 4884.7 4893.6 4899.4 5206.2 5206.9 5224.6 5247.9 5255.3 4967.6 5075.5 5088.7 5111.8 5137.5 4802.4 4851.5 4869.6 4915.5 4921.3 3668.3 3676.2 3680.8 3688.1 3697.3 4995.5 5134.6 5177.0 5181.2 5257.3 5029.6 5038.4 5044.3 5052.3 5059.8 5038.7 5042.8 5071.1 5077.7 5088.5 4757.2 4934.3 4996.4 5047.5 5050.9 4951.4 5032.7 5134.1 5182.4 5184.4 5061.2 5064.8 5069.8 5073.9 5077.5 08:59:38 INFO - PROCESS | 27363 | 08:59:38 INFO - PROCESS | 27363 | [#5] yui.html Cycles:180 Average:15944.18 Median:45735.66 stddev:22338.16 (48.8%) stddev-sans-first:22371.09 08:59:38 INFO - PROCESS | 27363 | Values: 594.1 594.3 604.7 664.6 666.3 11830.9 12925.3 13059.1 13129.7 13132.2 11949.3 12431.8 12434.7 12524.8 12591.0 741.4 767.2 770.1 770.4 770.9 636.2 749.6 773.2 778.3 781.0 809.5 812.4 812.6 812.9 813.0 806.5 808.1 808.2 808.3 808.4 481.5 565.2 584.1 585.5 594.1 12300.4 12338.9 12392.8 12411.3 12431.8 10784.7 11084.6 11112.4 11439.1 11496.4 11375.6 11404.3 11435.8 11541.4 11624.6 3968.4 3976.1 3976.1 4077.8 4086.4 52113.7 53045.5 53353.5 60174.4 60416.4 9350.2 9409.9 9657.5 9666.1 9728.0 16827.6 16876.8 16896.4 16898.2 16958.3 6018.8 6138.9 6165.6 6384.6 6471.0 3398.3 3415.9 3428.6 3478.4 3513.1 2700.3 2799.2 2816.0 2819.4 2825.8 506.5 507.1 510.5 514.2 519.0 561.5 604.7 606.5 607.5 608.0 7632.7 7898.1 7974.2 8134.1 8202.2 488.4 519.8 523.9 531.0 548.7 3703.7 3749.6 3756.3 3781.6 3869.5 90486.5 92901.0 93068.0 93902.5 94471.0 68972.7 70122.3 80860.6 82296.2 82826.6 43135.4 43270.0 43714.6 44339.6 72003.0 7914.8 8145.0 8161.0 8208.4 8371.8 30337.5 38559.0 39727.6 43245.0 44129.0 39749.0 47131.8 59178.4 59268.0 63848.4 10777.2 11079.8 11325.8 11429.7 11932.9 11238.3 11384.4 11409.7 11632.4 11908.2 10949.9 11027.8 11371.7 11645.6 11655.4 11397.9 11539.4 11661.0 11954.1 12072.3 10470.7 10703.9 10830.6 11038.7 11277.8 9861.2 9953.3 10123.2 10266.7 10299.8 9308.2 9928.4 10151.5 10241.2 10313.4 08:59:38 INFO - PROCESS | 27363 | -------- Summary: end -------- 08:59:38 INFO - PROCESS | 27363 | 08:59:39 INFO - TEST-INFO | 27363: exit 0 08:59:39 INFO - TEST-OK | dromaeo_css | took 1119807ms 08:59:39 INFO - TEST-START | kraken 08:59:39 INFO - operating with platform_type : linux_ 08:59:39 INFO - Initialising browser for kraken test... 08:59:39 INFO - TEST-INFO | started process 27549 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpiy2hlb/profile http://localhost:34509/getInfo.html) 08:59:43 INFO - PROCESS | 27549 | __metrics Screen width/height:1600/1200 08:59:43 INFO - PROCESS | 27549 | colorDepth:24 08:59:43 INFO - PROCESS | 27549 | Browser inner width/height: 1024/697 08:59:43 INFO - PROCESS | 27549 | __metrics 08:59:44 INFO - PROCESS | 27549 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 08:59:44 INFO - PROCESS | 27549 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 122: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:59:45 INFO - TEST-INFO | 27549: exit 0 08:59:45 INFO - Browser initialized. 08:59:45 INFO - Running cycle 1/1 for kraken test... 08:59:45 INFO - TEST-INFO | started process 27626 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpiy2hlb/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:59:57 INFO - PROCESS | 27626 | RSS: Main: 157040640 08:59:57 INFO - PROCESS | 27626 | 08:59:59 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:34509/tests/kraken/driver.html?testName=audio-beat-detection) 09:00:00 INFO - PROCESS | 27626 | RSS: Main: 213835776 09:00:00 INFO - PROCESS | 27626 | 09:00:03 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:34509/tests/kraken/driver.html?testName=audio-dft) 09:00:04 INFO - PROCESS | 27626 | RSS: Main: 190619648 09:00:04 INFO - PROCESS | 27626 | 09:00:07 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:34509/tests/kraken/driver.html?testName=audio-fft) 09:00:07 INFO - PROCESS | 27626 | RSS: Main: 272158720 09:00:07 INFO - PROCESS | 27626 | 09:00:10 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:34509/tests/kraken/driver.html?testName=audio-oscillator) 09:00:10 INFO - PROCESS | 27626 | RSS: Main: 180350976 09:00:10 INFO - PROCESS | 27626 | 09:00:12 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:34509/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:00:13 INFO - PROCESS | 27626 | RSS: Main: 184745984 09:00:13 INFO - PROCESS | 27626 | 09:00:16 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:34509/tests/kraken/driver.html?testName=imaging-darkroom) 09:00:17 INFO - PROCESS | 27626 | RSS: Main: 221204480 09:00:17 INFO - PROCESS | 27626 | 09:00:20 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:34509/tests/kraken/driver.html?testName=imaging-desaturate) 09:00:21 INFO - PROCESS | 27626 | RSS: Main: 215064576 09:00:21 INFO - PROCESS | 27626 | 09:00:24 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:34509/tests/kraken/driver.html?testName=json-parse-financial) 09:00:24 INFO - PROCESS | 27626 | RSS: Main: 218173440 09:00:24 INFO - PROCESS | 27626 | 09:00:26 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:34509/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:00:27 INFO - PROCESS | 27626 | RSS: Main: 184090624 09:00:27 INFO - PROCESS | 27626 | 09:00:29 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:34509/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:00:29 INFO - PROCESS | 27626 | RSS: Main: 190271488 09:00:29 INFO - PROCESS | 27626 | 09:00:31 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:34509/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:00:32 INFO - PROCESS | 27626 | RSS: Main: 194277376 09:00:32 INFO - PROCESS | 27626 | 09:00:35 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:34509/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:00:35 INFO - PROCESS | 27626 | RSS: Main: 189960192 09:00:35 INFO - PROCESS | 27626 | 09:00:38 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:34509/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:00:39 INFO - PROCESS | 27626 | RSS: Main: 192454656 09:00:39 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | Cycle 1(1): loaded http://localhost:34509/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:34509/tests/kraken/driver.html?testName=ai-astar) 09:00:41 INFO - PROCESS | 27626 | RSS: Main: 243343360 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | __start_tp_report 09:00:41 INFO - PROCESS | 27626 | _x_x_mozilla_page_load 09:00:41 INFO - PROCESS | 27626 | _x_x_mozilla_page_load_details 09:00:41 INFO - PROCESS | 27626 | |i|pagename|runs| 09:00:41 INFO - PROCESS | 27626 | |0;ai-astar;104;114;113;112;114;113;113;113;113;112 09:00:41 INFO - PROCESS | 27626 | |1;audio-beat-detection;164;127;132;193;124;126;150;121;158;126 09:00:41 INFO - PROCESS | 27626 | |2;audio-dft;161;161;161;162;159;162;161;164;162;161 09:00:41 INFO - PROCESS | 27626 | |3;audio-fft;74;76;76;122;76;76;74;74;105;76 09:00:41 INFO - PROCESS | 27626 | |4;audio-oscillator;84;85;120;85;86;85;122;86;84;122 09:00:41 INFO - PROCESS | 27626 | |5;imaging-gaussian-blur;117;117;116;117;117;116;116;116;116;117 09:00:41 INFO - PROCESS | 27626 | |6;imaging-darkroom;146;147;147;147;147;147;148;146;146;146 09:00:41 INFO - PROCESS | 27626 | |7;imaging-desaturate;95;95;95;95;95;95;95;96;95;95 09:00:41 INFO - PROCESS | 27626 | |8;json-parse-financial;62;62;61;61;62;62;61;61;61;61 09:00:41 INFO - PROCESS | 27626 | |9;json-stringify-tinderbox;65;65;65;65;66;65;65;67;67;70 09:00:41 INFO - PROCESS | 27626 | |10;stanford-crypto-aes;80;78;80;79;79;88;78;78;79;80 09:00:41 INFO - PROCESS | 27626 | |11;stanford-crypto-ccm;142;127;129;139;128;128;134;128;171;127 09:00:41 INFO - PROCESS | 27626 | |12;stanford-crypto-pbkdf2;175;167;165;165;167;164;168;163;163;164 09:00:41 INFO - PROCESS | 27626 | |13;stanford-crypto-sha256-iterative;67;70;68;67;70;65;67;67;65;65 09:00:41 INFO - PROCESS | 27626 | __end_tp_report 09:00:41 INFO - PROCESS | 27626 | __start_cc_report 09:00:41 INFO - PROCESS | 27626 | _x_x_mozilla_cycle_collect,1936 09:00:41 INFO - PROCESS | 27626 | __end_cc_report 09:00:41 INFO - PROCESS | 27626 | __startTimestamp1469808041338__endTimestamp 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | ------- Summary: start ------- 09:00:41 INFO - PROCESS | 27626 | Number of tests: 14 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#0] ai-astar Cycles:10 Average:112.10 Median:113.00 stddev:2.92 (2.6%) stddev-sans-first:0.71 09:00:41 INFO - PROCESS | 27626 | Values: 104.0 114.0 113.0 112.0 114.0 113.0 113.0 113.0 113.0 112.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#1] audio-beat-detection Cycles:10 Average:142.10 Median:141.00 stddev:23.59 (16.7%) stddev-sans-first:23.65 09:00:41 INFO - PROCESS | 27626 | Values: 164.0 127.0 132.0 193.0 124.0 126.0 150.0 121.0 158.0 126.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#2] audio-dft Cycles:10 Average:161.40 Median:161.50 stddev:1.26 (0.8%) stddev-sans-first:1.33 09:00:41 INFO - PROCESS | 27626 | Values: 161.0 161.0 161.0 162.0 159.0 162.0 161.0 164.0 162.0 161.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#3] audio-fft Cycles:10 Average:82.90 Median:76.00 stddev:16.64 (21.9%) stddev-sans-first:17.34 09:00:41 INFO - PROCESS | 27626 | Values: 74.0 76.0 76.0 122.0 76.0 76.0 74.0 74.0 105.0 76.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#4] audio-oscillator Cycles:10 Average:95.90 Median:85.00 stddev:17.57 (20.7%) stddev-sans-first:18.10 09:00:41 INFO - PROCESS | 27626 | Values: 84.0 85.0 120.0 85.0 86.0 85.0 122.0 86.0 84.0 122.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#5] imaging-gaussian-blur Cycles:10 Average:116.50 Median:117.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 09:00:41 INFO - PROCESS | 27626 | Values: 117.0 117.0 116.0 117.0 117.0 116.0 116.0 116.0 116.0 117.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#6] imaging-darkroom Cycles:10 Average:146.70 Median:147.00 stddev:0.67 (0.5%) stddev-sans-first:0.67 09:00:41 INFO - PROCESS | 27626 | Values: 146.0 147.0 147.0 147.0 147.0 147.0 148.0 146.0 146.0 146.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 09:00:41 INFO - PROCESS | 27626 | Values: 95.0 95.0 95.0 95.0 95.0 95.0 95.0 96.0 95.0 95.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#8] json-parse-financial Cycles:10 Average:61.40 Median:61.50 stddev:0.52 (0.8%) stddev-sans-first:0.50 09:00:41 INFO - PROCESS | 27626 | Values: 62.0 62.0 61.0 61.0 62.0 62.0 61.0 61.0 61.0 61.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#9] json-stringify-tinderbox Cycles:10 Average:66.00 Median:65.50 stddev:1.63 (2.5%) stddev-sans-first:1.69 09:00:41 INFO - PROCESS | 27626 | Values: 65.0 65.0 65.0 65.0 66.0 65.0 65.0 67.0 67.0 70.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#10] stanford-crypto-aes Cycles:10 Average:79.90 Median:79.50 stddev:2.96 (3.7%) stddev-sans-first:3.14 09:00:41 INFO - PROCESS | 27626 | Values: 80.0 78.0 80.0 79.0 79.0 88.0 78.0 78.0 79.0 80.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#11] stanford-crypto-ccm Cycles:10 Average:135.30 Median:131.50 stddev:13.63 (10.4%) stddev-sans-first:14.24 09:00:41 INFO - PROCESS | 27626 | Values: 142.0 127.0 129.0 139.0 128.0 128.0 134.0 128.0 171.0 127.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:166.10 Median:166.00 stddev:3.57 (2.2%) stddev-sans-first:1.83 09:00:41 INFO - PROCESS | 27626 | Values: 175.0 167.0 165.0 165.0 167.0 164.0 168.0 163.0 163.0 164.0 09:00:41 INFO - PROCESS | 27626 | 09:00:41 INFO - PROCESS | 27626 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.10 Median:67.00 stddev:1.85 (2.8%) stddev-sans-first:1.96 09:00:41 INFO - PROCESS | 27626 | Values: 67.0 70.0 68.0 67.0 70.0 65.0 67.0 67.0 65.0 65.0 09:00:41 INFO - PROCESS | 27626 | -------- Summary: end -------- 09:00:41 INFO - PROCESS | 27626 | 09:00:42 INFO - TEST-INFO | 27626: exit 0 09:00:42 INFO - TEST-OK | kraken | took 63309ms 09:00:42 INFO - SUITE-END | took 1183s 09:00:42 INFO - Completed test suite (00:19:43) 09:00:42 INFO - javascript benchmark 09:00:42 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2651.482960822639, 2653.1244689252526, 2691.865406729664, 2703.4998525272827, 2706.2016705072015, 4618.05329907369, 4715.717056976575, 4782.593479554238, 4897.36334276544, 4900.87747806305, 4740.573348398643, 4791.784369703363, 4802.08760335536, 4804.111239420701, 4863.975680121604, 4419.955800441987, 4477.306017567283, 4487.349334346518, 4488.192125417424, 4588.931166032496, 4506.526814684444, 4508.932366014513, 4518.118966801475, 4518.141553104916, 4537.160625284317, 4291.91416171678, 4338.913221735579, 4349.391085248036, 4456.442944631921, 4463.285874260103, 4396.20868243716, 4400.603945644907, 4402.647788176938, 4403.383526306319, 4405.537418571068, 4356.302991521373, 4373.103513779667, 4406.603405693503, 4413.735175889425, 4532.86401407955, 4748.0, 4840.636952228597, 4851.539103785135, 4887.9490909454635, 4903.239997800347, 5247.842564723064, 5249.081410753103, 5253.9737301313635, 5257.290265814105, 5258.0535503609335, 4982.327385802906, 5095.006473737622, 5111.846644600668, 5152.0, 5272.868178295535, 4810.735409552473, 4819.325294458778, 4861.052094841472, 4863.294822250754, 4866.9513304867205, 5318.73406329682, 5319.521243088141, 5328.520433161034, 5328.760205790749, 5334.986352592995, 4932.778024988884, 4968.577670898014, 5034.295198672189, 5035.77339019745, 5104.285400043997, 5095.464976177522, 5142.382914050338, 5160.7935682573025, 5188.45521220274, 5194.376674798973, 5068.847934561969, 5075.187969924795, 5094.2103973884105, 5101.002036009389, 5148.716820574904, 4892.779824907888, 4942.5057494251005, 5021.372328458942, 5022.121128802518, 5070.467600901926, 4293.4203882476095, 4297.527272000078, 4301.0, 4339.34909763538, 4339.609435150852, 3751.7186211033736, 3771.1891943232336, 3812.4090765931323, 3812.5424949006297, 3819.102510909934, 4291.463567054118, 4333.8699839004885, 4399.318105693623, 4405.229084910128, 4418.911621767611, 5152.948470515247, 5240.4759524047295, 5246.6065045121, 5246.790128394898, 5262.184361423985, 4481.820727170942, 4486.955130448719, 4488.910221795546, 4497.100579884036, 4525.796339164745, 4472.798724057425, 4577.473590537131, 4689.20283551797, 4691.976540117277, 4719.95280047202, 4813.855584332546, 4834.782434790513, 4842.709437433765, 4876.390451193601, 4890.828820991248, 5148.76830542634, 5158.638895277295, 5160.638755287094, 5162.045021671003, 5210.14032684618, 4660.184467718203, 4765.451973023008, 4782.760861956818, 4845.103655823684, 4891.192953162688, 5090.669106508065, 5136.229565565195, 5142.460041695568, 5155.664881782822, 5179.922301165561, 5164.9741751291, 5194.168932970707, 5202.869928251824, 5211.374635043819, 5253.474652534716, 4843.830465933675, 4896.36347274852, 5055.418626857959, 5056.241563765318, 5068.0, 4947.505249475168, 5004.5746111579465, 5015.147424937696, 5026.170681837456, 5039.244113383022, 4893.486183950634, 4903.656744027884, 4940.752962351796, 4944.060628480577, 4945.18404463274, 4830.7826147822725, 4912.459629440687, 5018.6198795331575, 5035.370578677665, 5037.395512538519, 4871.244957031666, 4899.951000489949, 4900.803967841246, 4916.680415772963, 4939.357883475125], "value": 4722.138124517919, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [546.2713055052316, 583.8248525442369, 584.6696616411728, 591.9852003699908, 593.7743657410183, 26940.326491837688, 38047.61952380479, 38926.61073389265, 38964.80517597415, 42536.0, 39218.80390598043, 39772.80113599435, 39849.80075099628, 39878.80060599693, 39983.200335993264, 7435.702571897117, 7772.766816995485, 7957.801054973614, 7965.044194696616, 9632.325737198398, 9703.805923881519, 10197.082262596365, 10200.438975856325, 10201.489925503733, 10205.234607404474, 10209.2853500255, 10243.487825608727, 10262.179025677966, 10262.435566043865, 10262.58949642017, 10216.438095904723, 10266.281360304707, 10270.229732770073, 10272.97270272978, 10275.845862312071, 9768.853467197998, 9821.0, 9823.165030972375, 9828.754281142958, 9843.852342214872, 37821.62178378236, 38280.0, 38298.42552361717, 38312.0, 38475.42286865699, 2959.2306000439826, 3047.238190452387, 3290.835458227103, 3653.9269214615824, 3725.4411838224214, 29179.85410072957, 29265.41469170626, 29289.85355073211, 29674.406511869856, 30150.396992060254, 2834.376437183816, 2840.758535524483, 2850.1974173517688, 2857.7142285771256, 2872.8508596561333, 245566.0, 245732.0, 245842.0, 246114.0, 246368.0, 50533.0, 50827.74586127046, 50921.23618145731, 50923.23615145776, 50943.0, 32760.83619581887, 33560.32879342448, 33598.83200583982, 35352.0, 53876.73061634745, 14428.639284017983, 14502.927485362507, 14505.927470362582, 14512.0, 14514.20171890535, 10133.594656213669, 10847.511861966073, 11739.765204695857, 11830.822537661941, 11851.288922664668, 17854.464366069038, 17865.910670446563, 17883.910580447013, 18115.36596219126, 18125.818741812676, 6599.8020059398295, 6800.183977922681, 6815.761448349284, 6889.138857642794, 7005.443013300109, 781.183663072091, 861.2894362151251, 910.5902343945252, 913.1598928985217, 943.4433684126399, 27536.0, 28057.43885122286, 28506.00228992017, 28547.031460216636, 28697.856510717313, 945.0879900895669, 973.2019743810149, 1048.2033654422542, 1059.1209296284067, 1088.5210507376728, 14202.360893759806, 14973.925130374279, 15030.248487575578, 15192.92444373612, 15290.847091528942, 118616.40691796486, 119668.40165799115, 119895.0, 120092.3995380035, 121153.39423302827, 48263.27605085926, 48715.0, 48770.0, 48937.755311223926, 48949.265761013616, 1075.1130317488103, 1120.882307357732, 1153.9076873849904, 1161.1581603337513, 1166.877477864829, 25623.871880640476, 29071.7092829069, 29113.708862911946, 29720.554191687574, 29768.0, 41214.0, 41659.16681666289, 41728.0, 41786.1642767149, 41809.79095104627, 318471.0, 322287.0, 322339.0, 322950.0, 323553.0, 24848.254552362734, 25213.87393063023, 25613.0, 25624.743752562983, 27045.188644340702, 41003.564875229225, 41166.79416602898, 41642.0, 42139.0, 42568.0, 35648.465273021444, 35715.64284357227, 35983.64016359803, 36409.27181456303, 36527.26945461129, 35291.470627940085, 35469.29061418809, 36045.09887252735, 36159.096022599646, 36241.27517449584, 34610.48084278688, 35046.0, 35490.821510855, 35918.8204058978, 36241.81879090693, 30759.846200768854, 33140.0, 33179.17052073718, 33262.50106248457, 33324.66675333216, 24882.502349952538, 25300.62049069302, 25430.745692542838, 25462.23613291604, 25463.490730184923], "value": 17186.6168637899, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [352.56458274031553, 373.10827123175613, 377.56014243406435, 386.576698515126, 394.68819632490334, 12762.234265944038, 16089.67820643588, 16476.176191190436, 17748.556286092855, 17880.642387152282, 17408.47774566762, 17418.129093545336, 17606.82393176068, 17666.116694165306, 17824.197911094, 5118.385793704751, 5338.3060202173665, 5600.243967064455, 5639.68981706006, 5705.286839145107, 3556.822158892058, 5114.156164232897, 5643.746031428575, 5684.204211410406, 5686.715664216773, 5407.567394608422, 5435.918461223065, 5473.698946557938, 5474.972625136868, 5482.0406428874985, 5217.921731174036, 5395.163749618815, 5437.34751829779, 5438.755256013469, 5452.536534394581, 5270.1040823060175, 5282.815101471469, 5284.418713941502, 5285.101532739405, 5291.894162116774, 11814.763704725858, 11846.111541634413, 11879.22785018971, 11931.463084161234, 11979.640610781691, 1692.6953148433277, 1720.1227374039331, 1735.7396390541394, 1738.6261953679893, 1956.7945365736678, 8637.79070930064, 9383.76540586484, 9573.760655983657, 13034.869651303461, 13042.282674452901, 1749.1429199692186, 1757.5166829122093, 1760.5070580237555, 1762.2541012009074, 1791.3192986665115, 50206.999999999636, 60812.0, 64173.358266417206, 66619.66690166615, 67807.66096169487, 8958.552072396355, 9153.908460915438, 10304.484775761182, 10357.896421035693, 10569.312994655324, 14445.855541444662, 14466.0, 14467.0, 14475.927620362041, 14488.565343039725, 7454.664540095709, 7482.925170748332, 7602.239776022354, 7656.349210317074, 7734.806629834186, 7296.854062918712, 7303.342699156995, 7348.0, 7470.0, 7481.9251807482315, 4111.876643700634, 4266.869279640898, 4350.260455722535, 4470.776461176928, 4665.720056796603, 1634.8283430239892, 1764.6206065695937, 1779.6885545029568, 1855.9536011599819, 1858.9814101859079, 743.5724458436421, 814.6497006287235, 846.7883029242689, 902.5757893789909, 946.2477330522252, 15162.0, 16395.0, 17707.46877593674, 17888.195031223626, 18294.542636434195, 810.3274282345639, 820.729159377404, 824.9298809601131, 864.8270345930839, 885.8626912828522, 8132.75601731949, 10145.797084058426, 10157.238207134347, 10185.541650625739, 10203.693889183336, 289525.0, 289566.0, 292278.0, 379036.0, 381493.0, 82726.58636706778, 83793.0, 85681.57159214164, 87016.56491717628, 87999.56000219958, 915.3135148638521, 923.8290916180528, 924.8751418558409, 938.7324612485409, 953.3612479638658, 15145.545633631009, 15243.085414875142, 16361.427350042692, 16492.34030638809, 16714.247858846138, 35655.0, 38931.80534097425, 39828.2034359317, 40147.397789032606, 40293.59706402898, 45309.77345113253, 54940.45059549353, 55331.0, 56272.71863640656, 56412.71793641005, 7552.735654252295, 7594.848103038019, 7768.883466748116, 7912.84174316522, 8071.798205044921, 11408.885911140782, 11667.124965627781, 11946.283223006647, 12001.079827227602, 12803.679908002001, 10314.329568578018, 10475.58097676115, 10564.260501764802, 10644.680659580225, 10818.891811081789, 10346.32748871321, 10471.790564188826, 10637.734056648645, 10773.299735517166, 11055.0, 10414.635487757892, 10628.574857005942, 10823.0, 11042.779144417227, 11106.333619982826, 7325.157606875277, 7350.228226036403, 7361.595112268877, 7461.4030877528585, 7708.929043719627, 5188.844334669966, 10520.78958420812, 10535.736606584896, 10662.466876656292, 10662.8933710665], "value": 8138.474534892167, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1334.306160796386, 1403.4035534897669, 1423.267017485995, 1652.917354132293, 1693.5173475559461, 7449.217832127623, 7934.642941067651, 7950.602469876505, 7953.6420861061315, 7958.641861116249, 6454.870902581945, 6611.867762644744, 6619.801405957817, 6772.255051944295, 7783.532988020723, 1866.0203393218567, 2014.7783743788173, 2090.383336915606, 2095.486605781578, 2097.423208617635, 2109.7679255281905, 2140.218820130649, 2140.9036593353258, 2158.1151727791607, 2158.57907707997, 2052.47661846229, 2110.166484238725, 2110.567333696596, 2110.7783682713325, 2113.7357830271217, 2038.4088614301834, 2057.68105943579, 2065.6385132601736, 2077.210659949225, 2080.355089922129, 2016.2439085342996, 2020.7170996060563, 2025.3620109665408, 2034.52188735647, 2034.9796502035085, 7723.768286951345, 7775.183605721431, 7782.883256751154, 7786.377089832799, 7788.0, 4610.2623580227, 4613.1696294666945, 4710.952890471086, 4745.83389581363, 4750.097481478542, 2700.621912932191, 2744.794140439475, 2763.585462180669, 2766.460540194663, 2785.4150628368066, 873.8164985353084, 880.1527059961021, 880.9119088091139, 888.3337496877342, 896.3143195455482, 10065.547050382751, 10243.94878025605, 10264.922183170735, 10430.739231519272, 10431.791364172674, 4019.91960160801, 4203.684723645739, 4287.464066991626, 4348.152110338454, 4348.673849461303, 8992.8651070234, 9001.144891235323, 9013.459192448474, 9026.819463610822, 9038.186563209343, 4674.228752255908, 4680.251159814414, 4691.085238378483, 4708.858734237979, 4710.740909249956, 4214.7471151731, 4257.680673949404, 4260.467441569804, 4261.4673165854265, 4269.637080848101, 3375.4093033719, 3495.667911548399, 3621.257642183346, 3782.0544863784053, 3798.4112462568346, 1188.3820413385165, 1211.618340222827, 1226.0620625221713, 1230.6369620961839, 1230.772307123185, 715.4312321704258, 844.5523872347666, 847.326375531454, 860.8536548786722, 876.5704804645678, 5248.711320877312, 5265.341832270966, 5332.686346936564, 5447.673139611636, 5534.335879694382, 815.9510429374138, 817.3134566963779, 835.6406745099665, 882.6469412235028, 942.8727121838601, 3418.265073009315, 3432.1248081738995, 3585.30086633104, 3585.7848529088337, 3589.4795254688447, 8892.688755893512, 9320.8601870972, 9321.347505674537, 9338.972713001564, 9413.717588472357, 9011.0, 9317.860232096524, 9354.625814967325, 9580.616775328908, 9586.137247647745, 7038.260982596856, 7145.820939544917, 7164.104486939133, 7208.531445456028, 7225.313595208447, 5281.524662780368, 5357.357117145967, 5509.201165831012, 5533.916991245054, 5616.550675945996, 8968.641254350014, 9009.549522523717, 9011.684591039282, 9033.322500812334, 9115.908840911507, 8328.62521186536, 8668.826623467621, 8682.479051256945, 9111.726648200565, 9146.954265228898, 6685.431738302104, 6814.080099186546, 6816.556923799937, 6832.077669514552, 6835.69239384219, 6320.399562041599, 7049.400800931979, 7261.782146535613, 7298.540291941739, 7322.450816188701, 6817.7272909083085, 6945.201301850352, 7030.824229394306, 7111.9288807113335, 7141.607211603412, 6763.830904227434, 6775.491838112062, 6823.658817059227, 6873.725050997904, 6936.306369363023, 6124.5712800103565, 6223.439890409885, 6226.906596400967, 6235.220597425322, 6235.314115447207, 4587.620674585849, 4719.764011799465, 4804.0872234275375, 4825.445073816556, 4916.3362946001835, 4491.685582009228, 4515.729056256635, 4573.405457290531, 4625.190591646516, 4761.023990081955], "value": 4091.9757969440443, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [288.6723568749469, 294.7612433928518, 303.3235883978728, 304.60097272572915, 307.8937766470567, 4898.240772680236, 4955.801767929279, 4963.305137280783, 4965.131102057139, 4978.527039931209, 4565.383673204116, 4719.716816990983, 4722.268048452487, 4736.71579705217, 4874.0, 3729.142297271629, 3780.60303668115, 3786.5456145262606, 3796.9620303797024, 3844.5578758442716, 3833.5591406988133, 3847.095932455885, 3848.2880667076543, 3859.0318937342017, 3869.9806500967456, 3653.5615726112906, 3825.3496905526126, 3835.871091544192, 3859.6333348331864, 3865.439511270864, 3814.53140540891, 3831.7509361891666, 3833.5208098987628, 3842.7502212356108, 3866.0, 3363.9159021024425, 3365.814880181589, 3372.4941258811127, 3373.190434295776, 3406.931861362759, 4828.758562071883, 4848.878778030577, 4850.126977144113, 4863.927041094386, 4889.168841296988, 4264.893377665552, 4312.849050283225, 4325.6367059756285, 4330.653547716175, 4339.652827773771, 5111.821086261963, 5125.846224613268, 5127.461616530248, 5128.333316668846, 5135.6918584885025, 3593.425051991695, 3620.1130722972775, 3622.855085796565, 3629.5644522657185, 3633.7100329383215, 5206.401263854667, 5304.0, 5327.200919862013, 5405.702686352289, 5437.809676661337, 3700.278445703062, 3704.944425833615, 3710.703143748494, 3726.720495962814, 3736.1033351995325, 3772.5095737553943, 3783.1487915218854, 3785.2051069275763, 3788.3559794834946, 3802.6387493188104, 4348.412964249786, 4352.73883566987, 4356.934645980313, 4357.869263922087, 4374.825006999748, 4877.561019508261, 5108.157154069611, 5115.718635475085, 5116.258142569307, 5125.923111153335, 1276.6403779974298, 1295.6048405236493, 1297.4096785962365, 1297.5199176304827, 1305.5300091966885, 815.6370415165313, 874.2437791310598, 892.8392889279862, 904.4844438669895, 912.397817440486, 4531.776420366483, 4534.569215924482, 4547.658925580595, 4550.862284428893, 4551.977240113778, 5220.869478262998, 5250.684958902478, 5298.15229563268, 5312.0, 5318.361796584357, 4365.607095361433, 4532.138893610269, 4569.405977223007, 4572.291294849304, 4578.6264120763635, 2780.4717103750627, 2792.3437992071845, 2795.1474800185733, 2800.3279212988737, 2808.396194818124, 4864.975675121673, 4880.82917097907, 4901.725551356673, 4928.260760885824, 4931.284963680247, 5092.388913330424, 5285.2600635911, 5290.603204759658, 5292.364916210079, 5320.255164277004, 4871.561559459595, 4878.390201224847, 4884.682495637843, 4893.559579637849, 4899.363082799285, 5206.245094461357, 5206.869828254324, 5224.555912747459, 5247.927068807723, 5255.316808814982, 4967.577755890789, 5075.467075956972, 5088.745562721923, 5111.846644600668, 5137.537621614073, 4802.399700037496, 4851.466338702669, 4869.561739443467, 4915.459299476983, 4921.31101645777, 3668.3396988542318, 3676.191237927652, 3680.7607505512055, 3688.1332886772125, 3697.2975134724315, 4995.486603644368, 5134.614903882149, 5176.974115129551, 5181.222816577543, 5257.318767428716, 5029.64792464524, 5038.445770965118, 5044.344235249394, 5052.343195384577, 5059.797608095635, 5038.722870242025, 5042.84871453857, 5071.072992263064, 5077.669951453144, 5088.498892826551, 4757.21505951528, 4934.284528743384, 4996.375453068366, 5047.4952504749235, 5050.924236136388, 4951.3810773653295, 5032.672876263031, 5134.12719837621, 5182.429932707324, 5184.403793563789, 5061.215511595708, 5064.797408103782, 5069.822556210515, 5073.873153171053, 5077.517635824591], "value": 3845.1169316797987, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [594.1058706646496, 594.267709626439, 604.6916072802869, 664.5613894829413, 666.251090886423, 11830.940845295772, 12925.289109098996, 13059.085863989525, 13129.73740525189, 13132.21206727597, 11949.342786146759, 12431.751364972717, 12434.689132771662, 12524.81212781809, 12591.0, 741.4439170622047, 767.1829501580798, 770.102830202813, 770.3529035610086, 770.9036370453694, 636.1920361141348, 749.5989645539637, 773.2036002917005, 778.2567647896245, 781.0, 809.4819315637997, 812.4475356757403, 812.569338250728, 812.8821320908464, 812.959352032399, 806.5443024691031, 808.1433680298873, 808.1716240853114, 808.3008197908825, 808.4300568099476, 481.52810245958807, 565.203063680209, 584.0596639410545, 585.5491271720794, 594.1177351632822, 12300.384980751016, 12338.938305308506, 12392.81410778839, 12411.255324680547, 12431.75136497274, 10784.676459706221, 11084.61203857861, 11112.44437778108, 11439.084873210124, 11496.367699776509, 11375.601853935155, 11404.315741055563, 11435.828462573068, 11541.422928853524, 11624.558842642971, 3968.3849003404516, 3976.0855003349393, 3976.1252524444576, 4077.8368865245357, 4086.427900093989, 52113.73943130298, 53045.46954530444, 53353.46646533562, 60174.39825601732, 60416.39583604152, 9350.158485736316, 9409.858852117224, 9657.46883921377, 9666.130048295687, 9727.951360243154, 16827.579310517336, 16876.831231687527, 16896.40862569829, 16898.15509224534, 16958.321667133176, 6018.789342372996, 6138.907916381258, 6165.599236049642, 6384.6169229846355, 6471.0, 3398.337324221753, 3415.8804441844914, 3428.63999280072, 3478.3912815257227, 3513.0690367052753, 2700.2709268497397, 2799.1882354117483, 2815.957760633592, 2819.3938303264895, 2825.788065895066, 506.4935064935065, 507.13280290702573, 510.49206039990446, 514.1721827857147, 519.0423668331922, 561.4750208554932, 604.6674329118968, 606.4693393280879, 607.4893912698199, 607.9969600152059, 7632.656530456143, 7898.131205567383, 7974.162712915177, 8134.145914678992, 8202.220789025034, 488.378583104091, 519.7764961066778, 523.8821265215296, 530.9707966061826, 548.6570893191755, 3703.685186759156, 3749.643783840531, 3756.3050835595504, 3781.640744129303, 3869.5356557212754, 90486.54756726306, 92901.0, 93068.0, 93902.53048734713, 94471.0, 68972.65513672399, 70122.29877701157, 80860.59569702114, 82296.17703822885, 82826.58586707027, 43135.35296970548, 43270.0, 43714.56285437169, 44339.55660443419, 72003.0, 7914.802129946797, 8145.022597288364, 8160.97987751531, 8208.384371172067, 8371.83256334882, 30337.544936826405, 38559.0, 39727.60272397239, 43245.0, 44129.0, 39749.00627484336, 47131.764341178074, 59178.40821591729, 59268.0, 63848.36151638424, 10777.191710621892, 11079.778404431705, 11325.773484530428, 11429.657110286706, 11932.940335298616, 11238.269512481662, 11384.361419664117, 11409.657710268373, 11632.376948922558, 11908.225965312227, 10949.945250274017, 11027.83458248111, 11371.658850234175, 11645.59240426581, 11655.358955257203, 11397.943010285228, 11539.423028848692, 11661.008814250883, 11954.103442241692, 12072.275663460221, 10470.738231544272, 10703.946480267548, 10830.620928267474, 11038.724031899266, 11277.7744445109, 9861.211103111877, 9953.303268771117, 10123.190144788547, 10266.691999240034, 10299.845502317621, 9308.174845171421, 9928.404295742279, 10151.474357056695, 10241.180705543688, 10313.381197128196], "value": 6230.7003610433585, "unit": "score"}], "name": "dromaeo_css", "value": 6336.99390312278, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 114.0, 113.0, 112.0, 114.0, 113.0, 113.0, 113.0, 113.0, 112.0], "value": 112.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 127.0, 132.0, 193.0, 124.0, 126.0, 150.0, 121.0, 158.0, 126.0], "value": 142.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 161.0, 162.0, 159.0, 162.0, 161.0, 164.0, 162.0, 161.0], "value": 161.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 76.0, 76.0, 122.0, 76.0, 76.0, 74.0, 74.0, 105.0, 76.0], "value": 82.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 120.0, 85.0, 86.0, 85.0, 122.0, 86.0, 84.0, 122.0], "value": 95.9, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 116.0, 117.0, 117.0, 116.0, 116.0, 116.0, 116.0, 117.0], "value": 116.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 147.0, 147.0, 147.0, 147.0, 147.0, 148.0, 146.0, 146.0, 146.0], "value": 146.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0], "value": 95.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 62.0, 61.0, 61.0, 62.0, 62.0, 61.0, 61.0, 61.0, 61.0], "value": 61.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 65.0, 65.0, 65.0, 66.0, 65.0, 65.0, 67.0, 67.0, 70.0], "value": 66.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 78.0, 80.0, 79.0, 79.0, 88.0, 78.0, 78.0, 79.0, 80.0], "value": 79.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [142.0, 127.0, 129.0, 139.0, 128.0, 128.0, 134.0, 128.0, 171.0, 127.0], "value": 135.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [175.0, 167.0, 165.0, 165.0, 167.0, 164.0, 168.0, 163.0, 163.0, 164.0], "value": 166.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 70.0, 68.0, 67.0, 70.0, 65.0, 67.0, 67.0, 65.0, 65.0], "value": 67.1, "unit": "score"}], "name": "kraken", "value": 1528.4999999999998, "alertThreshold": 2.0}]} 09:00:42 INFO - Return code: 0 09:00:42 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:00:42 INFO - # TBPL SUCCESS # 09:00:42 INFO - Running post-action listener: _resource_record_post_action 09:00:42 INFO - [mozharness: 2016-07-29 16:00:42.663651Z] Finished run-tests step (success) 09:00:42 INFO - Running post-run listener: _resource_record_post_run 09:00:42 INFO - Total resource usage - Wall time: 1199s; CPU: 13.0%; Read bytes: 4096; Write bytes: 521895936; Read time: 12; Write time: 454436 09:00:42 INFO - TinderboxPrint: CPU usage
13.0% 09:00:42 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 09:00:42 INFO - TinderboxPrint: I/O write bytes / time
521,895,936 / 454,436 09:00:42 INFO - TinderboxPrint: CPU idle
8,327.2 (87.0%) 09:00:42 INFO - TinderboxPrint: CPU user
1,199.1 (12.5%) 09:00:42 INFO - TinderboxPrint: Swap in / out
0 / 0 09:00:42 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 236838912; Read time: 0; Write time: 228648 09:00:42 INFO - run-tests - Wall time: 1184s; CPU: 13.0%; Read bytes: 0; Write bytes: 284442624; Read time: 0; Write time: 225788 09:00:43 INFO - Running post-run listener: _upload_blobber_files 09:00:43 INFO - Blob upload gear active. 09:00:43 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:00:43 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 09:00:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:00:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:00:43 INFO - (blobuploader) - INFO - Open directory for files ... 09:00:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:00:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:00:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:00:47 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:00:47 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:00:47 INFO - (blobuploader) - INFO - Done attempting. 09:00:47 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 09:00:47 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:00:47 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:00:47 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 09:00:47 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:00:47 INFO - (blobuploader) - INFO - Done attempting. 09:00:47 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 09:00:47 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:00:47 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:00:48 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 09:00:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:00:48 INFO - (blobuploader) - INFO - Done attempting. 09:00:48 INFO - (blobuploader) - INFO - Iteration through files over. 09:00:48 INFO - Return code: 0 09:00:48 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:00:48 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:00:48 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a4df0485e176147a7ba2c912d69e75d94534b1e742df6b4b01e54289d05bd2aa8588552bf968524ab410d82d1df98a47a4a88f9672868db0c3020e7c3bbda0b6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6dbe55cadc2e4b1211fe4d60e456e0d560a552d44f1258e31255e28eaa6aac78a5e46a38eea34e50126d092a134dafc10a0f4adab2359977cb55bf652b2fa342", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a570de859702eae37fe83bf4f26002e495ff9754c8de8aa39456e7415504ea4e35d06b4f6f82e2e139b56785306cc0157ce79fb83ec19228ea30dbe0ae11367a"} 09:00:48 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:00:48 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:00:48 INFO - Contents: 09:00:48 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a4df0485e176147a7ba2c912d69e75d94534b1e742df6b4b01e54289d05bd2aa8588552bf968524ab410d82d1df98a47a4a88f9672868db0c3020e7c3bbda0b6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6dbe55cadc2e4b1211fe4d60e456e0d560a552d44f1258e31255e28eaa6aac78a5e46a38eea34e50126d092a134dafc10a0f4adab2359977cb55bf652b2fa342", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a570de859702eae37fe83bf4f26002e495ff9754c8de8aa39456e7415504ea4e35d06b4f6f82e2e139b56785306cc0157ce79fb83ec19228ea30dbe0ae11367a"} 09:00:48 INFO - Running post-run listener: copy_logs_to_upload_dir 09:00:48 INFO - Copying logs to upload dir... 09:00:48 INFO - mkdir: /builds/slave/test/build/upload/logs 09:00:48 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1249.537324 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-07-29 09:00:48.507859) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-29 09:00:48.511582) ========= 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=32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a4df0485e176147a7ba2c912d69e75d94534b1e742df6b4b01e54289d05bd2aa8588552bf968524ab410d82d1df98a47a4a88f9672868db0c3020e7c3bbda0b6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6dbe55cadc2e4b1211fe4d60e456e0d560a552d44f1258e31255e28eaa6aac78a5e46a38eea34e50126d092a134dafc10a0f4adab2359977cb55bf652b2fa342", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a570de859702eae37fe83bf4f26002e495ff9754c8de8aa39456e7415504ea4e35d06b4f6f82e2e139b56785306cc0157ce79fb83ec19228ea30dbe0ae11367a"} build_url:https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011245 build_url: 'https://queue.taskcluster.net/v1/task/aAAVpC9VQTWHhqORIXgx_g/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a4df0485e176147a7ba2c912d69e75d94534b1e742df6b4b01e54289d05bd2aa8588552bf968524ab410d82d1df98a47a4a88f9672868db0c3020e7c3bbda0b6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/6dbe55cadc2e4b1211fe4d60e456e0d560a552d44f1258e31255e28eaa6aac78a5e46a38eea34e50126d092a134dafc10a0f4adab2359977cb55bf652b2fa342", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/a570de859702eae37fe83bf4f26002e495ff9754c8de8aa39456e7415504ea4e35d06b4f6f82e2e139b56785306cc0157ce79fb83ec19228ea30dbe0ae11367a"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-29 09:00:48.537413) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-29 09:00:48.537731) ========= 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=32c5991c409366f7fec8a718000001d2-1469803137.455937-1858889334 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-07-29 09:00:48.621734) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-29 09:00:48.622074) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-29 09:00:48.622357) ========= ========= Total master_lag: 0.19 =========