builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-057 starttime: 1470094015.68 results: success (0) buildid: 20160801155249 builduid: 5c300909baed4d01b0f3e7e6aea09d14 revision: bdfe8fd853b927c7d4fc3a45237f4cd35e49e86c ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:55.677525) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:55.677927) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:55.678197) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:55.695420) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:55.695693) ========= 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=934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-01 16:26:56-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 68.6M=0s 2016-08-01 16:26:56 (68.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.077968 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:55.787964) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:55.788250) ========= 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=934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.013965 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:55.837062) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-01 16:26:55.837408) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev bdfe8fd853b927c7d4fc3a45237f4cd35e49e86c --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 bdfe8fd853b927c7d4fc3a45237f4cd35e49e86c --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=934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-01 16:26:56,212 truncating revision to first 12 chars 2016-08-01 16:26:56,212 Setting DEBUG logging. 2016-08-01 16:26:56,213 attempt 1/10 2016-08-01 16:26:56,213 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/bdfe8fd853b9?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-01 16:26:57,118 unpacking tar archive at: fx-team-bdfe8fd853b9/testing/mozharness/ program finished with exit code 0 elapsedTime=1.249262 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-08-01 16:26:57.100012) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:57.100380) ========= script_repo_revision: bdfe8fd853b927c7d4fc3a45237f4cd35e49e86c ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:57.100780) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:57.101048) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-01 16:26:57.110970) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2016-08-01 16:26:57.111285) ========= /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=934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:26:57 INFO - MultiFileLogger online at 20160801 16:26:57 in /builds/slave/test 16:26:57 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 16:26:57 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:26:57 INFO - {'append_to_log': False, 16:26:57 INFO - 'base_work_dir': '/builds/slave/test', 16:26:57 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 16:26:57 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:26:57 INFO - 'branch': 'Fx-Team-Non-PGO', 16:26:57 INFO - 'buildbot_json_path': 'buildprops.json', 16:26:57 INFO - 'config_files': ('talos/linux_config.py',), 16:26:57 INFO - 'default_actions': ('clobber', 16:26:57 INFO - 'read-buildbot-config', 16:26:57 INFO - 'download-and-extract', 16:26:57 INFO - 'populate-webroot', 16:26:57 INFO - 'create-virtualenv', 16:26:57 INFO - 'install', 16:26:57 INFO - 'run-tests'), 16:26:57 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:26:57 INFO - 'download_minidump_stackwalk': True, 16:26:57 INFO - 'download_symbols': 'ondemand', 16:26:57 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:26:57 INFO - 'tooltool.py': '/tools/tooltool.py', 16:26:57 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:26:57 INFO - '/tools/misc-python/virtualenv.py')}, 16:26:57 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:26:57 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:26:57 INFO - 'installer_path': 'installer.exe', 16:26:57 INFO - 'log_level': 'info', 16:26:57 INFO - 'log_name': 'talos', 16:26:57 INFO - 'log_to_console': True, 16:26:57 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:26:57 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:26:57 INFO - 'opt_config_files': (), 16:26:57 INFO - 'pip_index': False, 16:26:57 INFO - 'sps_profile': False, 16:26:57 INFO - 'sps_profile_interval': 0, 16:26:57 INFO - 'suite': 'dromaeojs', 16:26:57 INFO - 'system_bits': '32', 16:26:57 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:26:57 INFO - 'title': 'talos-linux64-ix-057', 16:26:57 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:26:57 INFO - 'use_talos_json': True, 16:26:57 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:26:57 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:26:57 INFO - 'work_dir': 'build'} 16:26:57 INFO - [mozharness: 2016-08-01 23:26:57.570357Z] Running clobber step. 16:26:57 INFO - Running pre-action listener: _resource_record_pre_action 16:26:57 INFO - Running main action method: clobber 16:26:57 INFO - rmtree: /builds/slave/test/build 16:26:57 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:26:58 INFO - Running post-action listener: _resource_record_post_action 16:26:58 INFO - [mozharness: 2016-08-01 23:26:58.029611Z] Finished clobber step (success) 16:26:58 INFO - [mozharness: 2016-08-01 23:26:58.029712Z] Running read-buildbot-config step. 16:26:58 INFO - Running pre-action listener: _resource_record_pre_action 16:26:58 INFO - Running main action method: read_buildbot_config 16:26:58 INFO - Using buildbot properties: 16:26:58 INFO - { 16:26:58 INFO - "project": "", 16:26:58 INFO - "product": "firefox", 16:26:58 INFO - "script_repo_revision": "production", 16:26:58 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 16:26:58 INFO - "repository": "", 16:26:58 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 16:26:58 INFO - "buildid": "20160801155249", 16:26:58 INFO - "pgo_build": "False", 16:26:58 INFO - "basedir": "/builds/slave/test", 16:26:58 INFO - "buildnumber": 3201, 16:26:58 INFO - "slavename": "talos-linux64-ix-057", 16:26:58 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 16:26:58 INFO - "platform": "ubuntu64_hw", 16:26:58 INFO - "scheduler": "tests-fx-team-linux64-talos", 16:26:58 INFO - "branch": "fx-team", 16:26:58 INFO - "repo_path": "integration/fx-team", 16:26:58 INFO - "revision": "bdfe8fd853b927c7d4fc3a45237f4cd35e49e86c", 16:26:58 INFO - "stage_platform": "linux64", 16:26:58 INFO - "builduid": "5c300909baed4d01b0f3e7e6aea09d14", 16:26:58 INFO - "slavebuilddir": "test" 16:26:58 INFO - } 16:26:58 INFO - Found installer url https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 16:26:58 INFO - Running post-action listener: _resource_record_post_action 16:26:58 INFO - [mozharness: 2016-08-01 23:26:58.032154Z] Finished read-buildbot-config step (success) 16:26:58 INFO - [mozharness: 2016-08-01 23:26:58.032243Z] Running download-and-extract step. 16:26:58 INFO - Running pre-action listener: _resource_record_pre_action 16:26:58 INFO - Running main action method: download_and_extract 16:26:58 INFO - mkdir: /builds/slave/test/build/tests 16:26:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:26:58 INFO - https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 16:26:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 16:26:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 16:26:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:26:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:26:58 INFO - Downloaded 1361 bytes. 16:26:58 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 16:26:58 INFO - Using the following test package requirements: 16:26:58 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 16:26:58 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 16:26:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 16:26:58 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 16:26:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 16:26:58 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 16:26:58 INFO - u'jsshell-linux-x86_64.zip'], 16:26:58 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 16:26:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 16:26:58 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 16:26:58 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 16:26:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 16:26:58 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 16:26:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 16:26:58 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 16:26:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 16:26:58 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 16:26:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 16:26:58 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 16:26:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:26:58 INFO - https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:26:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 16:26:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 16:26:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:26:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:26:59 INFO - Downloaded 20237575 bytes. 16:26:59 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'] 16:26:59 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 16:27:00 INFO - Return code: 0 16:27:00 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 16:27: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')]} 16:27:00 INFO - https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:27:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 16:27:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 16:27:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:27:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:27:04 INFO - Downloaded 20237575 bytes. 16:27:04 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'] 16:27:04 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 16:27:05 INFO - Return code: 0 16:27: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')]} 16:27:05 INFO - https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 16:27:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 16:27:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 16:27:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:27:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:27:07 INFO - Downloaded 14413723 bytes. 16:27:07 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'] 16:27:07 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 16:27:07 INFO - Return code: 0 16:27:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:27:07 INFO - https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 16:27:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 16:27:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 16:27:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:27:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MBYQhaKQQs-eFly-OGBWBA/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 16:27:09 INFO - Downloaded 55659772 bytes. 16:27:09 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 16:27:09 INFO - mkdir: /builds/slave/test/properties 16:27:09 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:27:09 INFO - Writing to file /builds/slave/test/properties/build_url 16:27:09 INFO - Contents: 16:27:09 INFO - build_url:https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 16:27:09 INFO - Running post-action listener: _resource_record_post_action 16:27:09 INFO - Running post-action listener: set_extra_try_arguments 16:27:09 INFO - [mozharness: 2016-08-01 23:27:09.960260Z] Finished download-and-extract step (success) 16:27:09 INFO - [mozharness: 2016-08-01 23:27:09.960490Z] Running populate-webroot step. 16:27:09 INFO - Running pre-action listener: _resource_record_pre_action 16:27:09 INFO - Running main action method: populate_webroot 16:27:09 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:27:09 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:27:09 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:27:09 INFO - '--tppagecycles', 16:27:09 INFO - '7'], 16:27:09 INFO - 'tests': ['tsvgm']}}, 16:27:09 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:27:09 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 16:27:09 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:27:09 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 16:27:09 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:27:09 INFO - 'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:27:09 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:27:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:27:09 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:27:09 INFO - 'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['damp', 'tps']}, 16:27:09 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:27:09 INFO - 'tests': ['damp', 'tps']}, 16:27:09 INFO - 'g3': {'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['dromaeo_dom']}, 16:27:09 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:27:09 INFO - 'g4': {'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['basic_compositor_video']}, 16:27:09 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 16:27:09 INFO - 'other': {'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['a11yr', 16:27:09 INFO - 'ts_paint', 16:27:09 INFO - 'tpaint', 16:27:09 INFO - 'sessionrestore', 16:27:09 INFO - 'sessionrestore_no_auto_restore', 16:27:09 INFO - 'tabpaint']}, 16:27:09 INFO - 'other-e10s': {'tests': ['a11yr', 16:27:09 INFO - 'ts_paint', 16:27:09 INFO - 'tpaint', 16:27:09 INFO - 'sessionrestore', 16:27:09 INFO - 'sessionrestore_no_auto_restore', 16:27:09 INFO - 'tabpaint']}, 16:27:09 INFO - 'other-e10s_l64': {'tests': ['a11yr', 16:27:09 INFO - 'ts_paint', 16:27:09 INFO - 'tpaint', 16:27:09 INFO - 'sessionrestore', 16:27:09 INFO - 'sessionrestore_no_auto_restore', 16:27:09 INFO - 'tabpaint']}, 16:27:09 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 16:27:09 INFO - 'ts_paint', 16:27:09 INFO - 'tpaint', 16:27:09 INFO - 'sessionrestore', 16:27:09 INFO - 'sessionrestore_no_auto_restore', 16:27:09 INFO - 'tabpaint']}, 16:27:09 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['a11yr', 16:27:09 INFO - 'ts_paint', 16:27:09 INFO - 'tpaint', 16:27:09 INFO - 'sessionrestore', 16:27:09 INFO - 'sessionrestore_no_auto_restore', 16:27:09 INFO - 'tabpaint']}, 16:27:09 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['a11yr', 16:27:09 INFO - 'ts_paint', 16:27:09 INFO - 'tpaint', 16:27:09 INFO - 'sessionrestore', 16:27:09 INFO - 'sessionrestore_no_auto_restore', 16:27:09 INFO - 'tabpaint']}, 16:27:09 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['tsvgx', 16:27:09 INFO - 'tsvgr_opacity', 16:27:09 INFO - 'tart', 16:27:09 INFO - 'tscrollx', 16:27:09 INFO - 'cart']}, 16:27:09 INFO - 'svgr-e10s': {'tests': ['tsvgx', 16:27:09 INFO - 'tsvgr_opacity', 16:27:09 INFO - 'tart', 16:27:09 INFO - 'tscrollx', 16:27:09 INFO - 'cart']}, 16:27:09 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:27:09 INFO - 'talos_options': ['--disable-e10s'], 16:27:09 INFO - 'tests': ['tp5o']}, 16:27:09 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:27:09 INFO - 'tests': ['tp5o']}, 16:27:09 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:27:09 INFO - 'talos_options': ['--disable-e10s', 16:27:09 INFO - '--xperf_path', 16:27:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:27:09 INFO - 'tests': ['tp5n']}, 16:27:09 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:27:09 INFO - 'talos_options': ['--xperf_path', 16:27:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:27:09 INFO - 'tests': ['tp5n']}}, 16:27:09 INFO - 'talos.zip': {'path': '', 16:27:09 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:27:09 INFO - Running post-action listener: _resource_record_post_action 16:27:09 INFO - [mozharness: 2016-08-01 23:27:09.982196Z] Finished populate-webroot step (success) 16:27:09 INFO - [mozharness: 2016-08-01 23:27:09.982285Z] Running create-virtualenv step. 16:27:09 INFO - Running pre-action listener: _resource_record_pre_action 16:27:09 INFO - Running main action method: create_virtualenv 16:27:09 INFO - Creating virtualenv /builds/slave/test/build/venv 16:27:09 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 16:27:09 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:27:10 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:27:10 INFO - Using real prefix '/usr' 16:27:10 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:27:10 INFO - Installing distribute.............................................................................................................................................................................................done. 16:27:12 INFO - Installing pip.................done. 16:27:12 INFO - Return code: 0 16:27:12 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:27:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:27:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:27:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 16:27:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 16:27:12 INFO - Using env: {'DISPLAY': ':0', 16:27:12 INFO - 'HOME': '/home/cltbld', 16:27:12 INFO - 'LANG': 'en_US.UTF-8', 16:27:12 INFO - 'LANGUAGE': 'en_US:en', 16:27:12 INFO - 'LOGNAME': 'cltbld', 16:27:12 INFO - 'MAIL': '/var/mail/cltbld', 16:27:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:12 INFO - 'MOZ_NO_REMOTE': '1', 16:27:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:12 INFO - 'NO_EM_RESTART': '1', 16:27:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:12 INFO - 'PWD': '/builds/slave/test', 16:27:12 INFO - 'SHELL': '/bin/bash', 16:27:12 INFO - 'SHLVL': '1', 16:27:12 INFO - 'TERM': 'linux', 16:27:12 INFO - 'TMOUT': '86400', 16:27:12 INFO - 'USER': 'cltbld', 16:27:12 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:12 INFO - '_': '/tools/buildbot/bin/python'} 16:27:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:12 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 16:27:12 INFO - Cleaning up... 16:27:12 INFO - Return code: 0 16:27:12 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 16:27:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:27:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:27:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 16:27:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 16:27:12 INFO - Using env: {'DISPLAY': ':0', 16:27:12 INFO - 'HOME': '/home/cltbld', 16:27:12 INFO - 'LANG': 'en_US.UTF-8', 16:27:12 INFO - 'LANGUAGE': 'en_US:en', 16:27:12 INFO - 'LOGNAME': 'cltbld', 16:27:12 INFO - 'MAIL': '/var/mail/cltbld', 16:27:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:12 INFO - 'MOZ_NO_REMOTE': '1', 16:27:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:12 INFO - 'NO_EM_RESTART': '1', 16:27:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:12 INFO - 'PWD': '/builds/slave/test', 16:27:12 INFO - 'SHELL': '/bin/bash', 16:27:12 INFO - 'SHLVL': '1', 16:27:12 INFO - 'TERM': 'linux', 16:27:12 INFO - 'TMOUT': '86400', 16:27:12 INFO - 'USER': 'cltbld', 16:27:12 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:12 INFO - '_': '/tools/buildbot/bin/python'} 16:27:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:12 INFO - Downloading/unpacking psutil>=3.1.1 16:27:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:27:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:27:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:27:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:27:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:27:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:27:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:27:14 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:27:14 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:27:14 INFO - Installing collected packages: psutil 16:27:14 INFO - Running setup.py install for psutil 16:27:15 INFO - building 'psutil._psutil_linux' extension 16:27:15 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 16:27:15 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 16:27:15 INFO - building 'psutil._psutil_posix' extension 16:27:15 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 16:27:15 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 16:27:15 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:27:15 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:27:15 INFO - Successfully installed psutil 16:27:15 INFO - Cleaning up... 16:27:15 INFO - Return code: 0 16:27:15 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 16:27:15 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')]} 16:27:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:15 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')]} 16:27:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:15 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 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27:15 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 16:27:15 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 16:27:15 INFO - Using env: {'DISPLAY': ':0', 16:27:15 INFO - 'HOME': '/home/cltbld', 16:27:15 INFO - 'LANG': 'en_US.UTF-8', 16:27:15 INFO - 'LANGUAGE': 'en_US:en', 16:27:15 INFO - 'LOGNAME': 'cltbld', 16:27:15 INFO - 'MAIL': '/var/mail/cltbld', 16:27:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:15 INFO - 'MOZ_NO_REMOTE': '1', 16:27:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:15 INFO - 'NO_EM_RESTART': '1', 16:27:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:15 INFO - 'PWD': '/builds/slave/test', 16:27:15 INFO - 'SHELL': '/bin/bash', 16:27:15 INFO - 'SHLVL': '1', 16:27:15 INFO - 'TERM': 'linux', 16:27:15 INFO - 'TMOUT': '86400', 16:27:15 INFO - 'USER': 'cltbld', 16:27:15 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:15 INFO - '_': '/tools/buildbot/bin/python'} 16:27:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:15 INFO - Downloading/unpacking mozsystemmonitor==0.3 16:27:15 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 16:27:15 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 16:27:15 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 16:27:15 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 16:27:15 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 16:27:15 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 16:27:17 INFO - Downloading mozsystemmonitor-0.3.tar.gz 16:27:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:27:17 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 16:27:17 INFO - Installing collected packages: mozsystemmonitor 16:27:17 INFO - Running setup.py install for mozsystemmonitor 16:27:17 INFO - Successfully installed mozsystemmonitor 16:27:17 INFO - Cleaning up... 16:27:17 INFO - Return code: 0 16:27:17 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 16:27: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')]} 16:27:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27: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')]} 16:27:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:17 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 16:27:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 16:27:17 INFO - Using env: {'DISPLAY': ':0', 16:27:17 INFO - 'HOME': '/home/cltbld', 16:27:17 INFO - 'LANG': 'en_US.UTF-8', 16:27:17 INFO - 'LANGUAGE': 'en_US:en', 16:27:17 INFO - 'LOGNAME': 'cltbld', 16:27:17 INFO - 'MAIL': '/var/mail/cltbld', 16:27:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:17 INFO - 'MOZ_NO_REMOTE': '1', 16:27:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:17 INFO - 'NO_EM_RESTART': '1', 16:27:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:17 INFO - 'PWD': '/builds/slave/test', 16:27:17 INFO - 'SHELL': '/bin/bash', 16:27:17 INFO - 'SHLVL': '1', 16:27:17 INFO - 'TERM': 'linux', 16:27:17 INFO - 'TMOUT': '86400', 16:27:17 INFO - 'USER': 'cltbld', 16:27:17 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:17 INFO - '_': '/tools/buildbot/bin/python'} 16:27:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:18 INFO - Downloading/unpacking jsonschema==2.5.1 16:27:18 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 16:27:18 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 16:27:18 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 16:27:18 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 16:27:18 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 16:27:18 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 16:27:19 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:27:19 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 16:27:19 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 16:27:19 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 16:27:19 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 16:27:19 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 16:27:19 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 16:27:19 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 16:27:20 INFO - Downloading functools32-3.2.3-2.tar.gz 16:27:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:27:20 INFO - warning: no files found matching '*.txt' 16:27:20 INFO - no previously-included directories found matching 'build' 16:27:20 INFO - no previously-included directories found matching 'dist' 16:27:20 INFO - no previously-included directories found matching '.git*' 16:27:20 INFO - Installing collected packages: jsonschema, functools32 16:27:20 INFO - Running setup.py install for functools32 16:27:20 INFO - warning: no files found matching '*.txt' 16:27:20 INFO - no previously-included directories found matching 'build' 16:27:20 INFO - no previously-included directories found matching 'dist' 16:27:20 INFO - no previously-included directories found matching '.git*' 16:27:20 INFO - Successfully installed jsonschema functools32 16:27:20 INFO - Cleaning up... 16:27:20 INFO - Return code: 0 16:27:20 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 16:27:20 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')]} 16:27:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:20 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')]} 16:27:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:20 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 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27:20 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 16:27:20 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 16:27:20 INFO - Using env: {'DISPLAY': ':0', 16:27:20 INFO - 'HOME': '/home/cltbld', 16:27:20 INFO - 'LANG': 'en_US.UTF-8', 16:27:20 INFO - 'LANGUAGE': 'en_US:en', 16:27:20 INFO - 'LOGNAME': 'cltbld', 16:27:20 INFO - 'MAIL': '/var/mail/cltbld', 16:27:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:20 INFO - 'MOZ_NO_REMOTE': '1', 16:27:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:20 INFO - 'NO_EM_RESTART': '1', 16:27:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:20 INFO - 'PWD': '/builds/slave/test', 16:27:20 INFO - 'SHELL': '/bin/bash', 16:27:20 INFO - 'SHLVL': '1', 16:27:20 INFO - 'TERM': 'linux', 16:27:20 INFO - 'TMOUT': '86400', 16:27:20 INFO - 'USER': 'cltbld', 16:27:20 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:20 INFO - '_': '/tools/buildbot/bin/python'} 16:27:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:20 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 16:27:20 INFO - Cleaning up... 16:27:20 INFO - Return code: 0 16:27:20 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:27:20 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')]} 16:27:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:20 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')]} 16:27:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:20 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 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27:20 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 16:27:20 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 16:27:20 INFO - Using env: {'DISPLAY': ':0', 16:27:20 INFO - 'HOME': '/home/cltbld', 16:27:20 INFO - 'LANG': 'en_US.UTF-8', 16:27:20 INFO - 'LANGUAGE': 'en_US:en', 16:27:20 INFO - 'LOGNAME': 'cltbld', 16:27:20 INFO - 'MAIL': '/var/mail/cltbld', 16:27:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:20 INFO - 'MOZ_NO_REMOTE': '1', 16:27:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:20 INFO - 'NO_EM_RESTART': '1', 16:27:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:20 INFO - 'PWD': '/builds/slave/test', 16:27:20 INFO - 'SHELL': '/bin/bash', 16:27:20 INFO - 'SHLVL': '1', 16:27:20 INFO - 'TERM': 'linux', 16:27:20 INFO - 'TMOUT': '86400', 16:27:20 INFO - 'USER': 'cltbld', 16:27:20 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:20 INFO - '_': '/tools/buildbot/bin/python'} 16:27:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:20 INFO - Downloading/unpacking blobuploader==1.2.4 16:27:20 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 16:27:20 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 16:27:20 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 16:27:20 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 16:27:20 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 16:27:20 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 16:27:22 INFO - Downloading blobuploader-1.2.4.tar.gz 16:27:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:27:22 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:27:22 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 16:27:22 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 16:27:22 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 16:27:22 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 16:27:22 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 16:27:22 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 16:27:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:27:23 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:27:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:27:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:27:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:27:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:27:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:27:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:27:23 INFO - Downloading docopt-0.6.1.tar.gz 16:27:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:27:23 INFO - Installing collected packages: blobuploader, requests, docopt 16:27:23 INFO - Running setup.py install for blobuploader 16:27:23 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:27:23 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:27:23 INFO - Running setup.py install for requests 16:27:23 INFO - Running setup.py install for docopt 16:27:23 INFO - Successfully installed blobuploader requests docopt 16:27:23 INFO - Cleaning up... 16:27:24 INFO - Return code: 0 16:27:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:27:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:27:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:27:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:24 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 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27:24 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 16:27:24 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 16:27:24 INFO - Using env: {'DISPLAY': ':0', 16:27:24 INFO - 'HOME': '/home/cltbld', 16:27:24 INFO - 'LANG': 'en_US.UTF-8', 16:27:24 INFO - 'LANGUAGE': 'en_US:en', 16:27:24 INFO - 'LOGNAME': 'cltbld', 16:27:24 INFO - 'MAIL': '/var/mail/cltbld', 16:27:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:24 INFO - 'MOZ_NO_REMOTE': '1', 16:27:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:24 INFO - 'NO_EM_RESTART': '1', 16:27:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:24 INFO - 'PWD': '/builds/slave/test', 16:27:24 INFO - 'SHELL': '/bin/bash', 16:27:24 INFO - 'SHLVL': '1', 16:27:24 INFO - 'TERM': 'linux', 16:27:24 INFO - 'TMOUT': '86400', 16:27:24 INFO - 'USER': 'cltbld', 16:27:24 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:24 INFO - '_': '/tools/buildbot/bin/python'} 16:27:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:27:24 INFO - Running setup.py (path:/tmp/pip-4M2xVU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:27:24 INFO - Running setup.py (path:/tmp/pip-2JW4eD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:27:24 INFO - Running setup.py (path:/tmp/pip-FpHKxC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:27:24 INFO - Running setup.py (path:/tmp/pip-7Ck0st-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:27:24 INFO - Running setup.py (path:/tmp/pip-C07CAV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:27:24 INFO - Running setup.py (path:/tmp/pip-KXUmol-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:27:24 INFO - Running setup.py (path:/tmp/pip-r8YoTj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:27:24 INFO - Running setup.py (path:/tmp/pip-Jc8UlO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:27:24 INFO - Running setup.py (path:/tmp/pip-36YPyT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:27:24 INFO - Running setup.py (path:/tmp/pip-URArMO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:27:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:27:24 INFO - Running setup.py (path:/tmp/pip-8x08u6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:27:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:27:25 INFO - Running setup.py (path:/tmp/pip-nmmBPO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:27:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:27:25 INFO - Running setup.py (path:/tmp/pip-H58DRp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:27:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:27:25 INFO - Running setup.py (path:/tmp/pip-NLqQDx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:27:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:27:25 INFO - Running setup.py (path:/tmp/pip-OPOTej-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:27:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:27:25 INFO - Running setup.py (path:/tmp/pip-TYGx55-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:27:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:27:25 INFO - Running setup.py (path:/tmp/pip-6C8_oM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:27:25 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:27:25 INFO - Running setup.py install for manifestparser 16:27:25 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:27:25 INFO - Running setup.py install for mozcrash 16:27:25 INFO - Running setup.py install for mozdebug 16:27:25 INFO - Running setup.py install for mozdevice 16:27:25 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:27:25 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:27:25 INFO - Running setup.py install for mozfile 16:27:25 INFO - Running setup.py install for mozhttpd 16:27:26 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Running setup.py install for mozinfo 16:27:26 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Running setup.py install for mozInstall 16:27:26 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Running setup.py install for mozleak 16:27:26 INFO - Running setup.py install for mozlog 16:27:26 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Running setup.py install for moznetwork 16:27:26 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Running setup.py install for mozprocess 16:27:26 INFO - Running setup.py install for mozprofile 16:27:26 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Running setup.py install for mozrunner 16:27:26 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:27:26 INFO - Running setup.py install for mozscreenshot 16:27:27 INFO - Running setup.py install for moztest 16:27:27 INFO - Running setup.py install for mozversion 16:27:27 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:27:27 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:27:27 INFO - Cleaning up... 16:27:27 INFO - Return code: 0 16:27:27 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:27:27 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')]} 16:27:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:27 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')]} 16:27:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:27 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 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27:27 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 16:27:27 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 16:27:27 INFO - Using env: {'DISPLAY': ':0', 16:27:27 INFO - 'HOME': '/home/cltbld', 16:27:27 INFO - 'LANG': 'en_US.UTF-8', 16:27:27 INFO - 'LANGUAGE': 'en_US:en', 16:27:27 INFO - 'LOGNAME': 'cltbld', 16:27:27 INFO - 'MAIL': '/var/mail/cltbld', 16:27:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:27 INFO - 'MOZ_NO_REMOTE': '1', 16:27:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:27 INFO - 'NO_EM_RESTART': '1', 16:27:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:27 INFO - 'PWD': '/builds/slave/test', 16:27:27 INFO - 'SHELL': '/bin/bash', 16:27:27 INFO - 'SHLVL': '1', 16:27:27 INFO - 'TERM': 'linux', 16:27:27 INFO - 'TMOUT': '86400', 16:27:27 INFO - 'USER': 'cltbld', 16:27:27 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:27 INFO - '_': '/tools/buildbot/bin/python'} 16:27:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:27:27 INFO - Running setup.py (path:/tmp/pip-f3SuuD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:27:27 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)) 16:27:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:27:27 INFO - Running setup.py (path:/tmp/pip-oOrC95-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:27:27 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)) 16:27:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:27:27 INFO - Running setup.py (path:/tmp/pip-eNghyt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:27:27 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)) 16:27:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:27:27 INFO - Running setup.py (path:/tmp/pip-tXDTLJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:27:27 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)) 16:27:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:27:27 INFO - Running setup.py (path:/tmp/pip-58DxJ2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:27:27 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)) 16:27:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:27:27 INFO - Running setup.py (path:/tmp/pip-sxAVmX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:27:27 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)) 16:27:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:27:27 INFO - Running setup.py (path:/tmp/pip-2B7gpa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:27:27 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)) 16:27:27 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:27:27 INFO - Running setup.py (path:/tmp/pip-tqrXA7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:27:28 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)) 16:27:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:27:28 INFO - Running setup.py (path:/tmp/pip-RlS6qs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:27:28 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)) 16:27:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:27:28 INFO - Running setup.py (path:/tmp/pip-gDPhOw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:27:28 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)) 16:27:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:27:28 INFO - Running setup.py (path:/tmp/pip-Z5izGw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:27:28 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)) 16:27:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:27:28 INFO - Running setup.py (path:/tmp/pip-c0GlrT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:27:28 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)) 16:27:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:27:28 INFO - Running setup.py (path:/tmp/pip-or2JHC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:27:28 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)) 16:27:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:27:28 INFO - Running setup.py (path:/tmp/pip-LBa4yV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:27:28 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)) 16:27:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:27:28 INFO - Running setup.py (path:/tmp/pip-n6iDiR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:27:28 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)) 16:27:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:27:28 INFO - Running setup.py (path:/tmp/pip-izA82T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:27:28 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)) 16:27:28 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:27:28 INFO - Running setup.py (path:/tmp/pip-kVseln-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:27:28 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)) 16:27:28 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)) 16:27:28 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)) 16:27:28 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)) 16:27:28 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)) 16:27:28 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)) 16:27:28 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:27:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:27:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:27:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:27:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:27:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:27:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:27:30 INFO - Downloading blessings-1.6.tar.gz 16:27:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:27:30 INFO - Installing collected packages: blessings 16:27:30 INFO - Running setup.py install for blessings 16:27:30 INFO - Successfully installed blessings 16:27:30 INFO - Cleaning up... 16:27:30 INFO - Return code: 0 16:27:30 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:27:30 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:27:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:27:31 INFO - Reading from file tmpfile_stdout 16:27:31 INFO - Current package versions: 16:27:31 INFO - argparse == 1.2.1 16:27:31 INFO - blessings == 1.6 16:27:31 INFO - blobuploader == 1.2.4 16:27:31 INFO - docopt == 0.6.1 16:27:31 INFO - functools32 == 3.2.3-2 16:27:31 INFO - jsonschema == 2.5.1 16:27:31 INFO - manifestparser == 1.1 16:27:31 INFO - mozInstall == 1.12 16:27:31 INFO - mozcrash == 0.17 16:27:31 INFO - mozdebug == 0.1 16:27:31 INFO - mozdevice == 0.48 16:27:31 INFO - mozfile == 1.2 16:27:31 INFO - mozhttpd == 0.7 16:27:31 INFO - mozinfo == 0.9 16:27:31 INFO - mozleak == 0.1 16:27:31 INFO - mozlog == 3.3 16:27:31 INFO - moznetwork == 0.27 16:27:31 INFO - mozprocess == 0.23 16:27:31 INFO - mozprofile == 0.28 16:27:31 INFO - mozrunner == 6.12 16:27:31 INFO - mozscreenshot == 0.1 16:27:31 INFO - mozsystemmonitor == 0.3 16:27:31 INFO - moztest == 0.7 16:27:31 INFO - mozversion == 1.4 16:27:31 INFO - psutil == 3.1.1 16:27:31 INFO - requests == 1.2.3 16:27:31 INFO - wsgiref == 0.1.2 16:27:31 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:27: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')]} 16:27:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27: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')]} 16:27:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27:31 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 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27:31 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 16:27:31 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 16:27:31 INFO - Using env: {'DISPLAY': ':0', 16:27:31 INFO - 'HOME': '/home/cltbld', 16:27:31 INFO - 'LANG': 'en_US.UTF-8', 16:27:31 INFO - 'LANGUAGE': 'en_US:en', 16:27:31 INFO - 'LOGNAME': 'cltbld', 16:27:31 INFO - 'MAIL': '/var/mail/cltbld', 16:27:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:31 INFO - 'MOZ_NO_REMOTE': '1', 16:27:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:31 INFO - 'NO_EM_RESTART': '1', 16:27:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:31 INFO - 'PWD': '/builds/slave/test', 16:27:31 INFO - 'SHELL': '/bin/bash', 16:27:31 INFO - 'SHLVL': '1', 16:27:31 INFO - 'TERM': 'linux', 16:27:31 INFO - 'TMOUT': '86400', 16:27:31 INFO - 'USER': 'cltbld', 16:27:31 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:31 INFO - '_': '/tools/buildbot/bin/python'} 16:27:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:31 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)) 16:27:31 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)) 16:27:31 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)) 16:27:31 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)) 16:27:31 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)) 16:27:31 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)) 16:27:31 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)) 16:27:31 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)) 16:27:31 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)) 16:27:31 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)) 16:27:31 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)) 16:27:31 INFO - Cleaning up... 16:27:31 INFO - Return code: 0 16:27:31 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:27: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')]} 16:27:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:27:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27: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')]} 16:27:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:27:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:27: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1ab8030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1d79180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, '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': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', '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 16:27: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', 'jsonschema'] in /builds/slave/test/build 16:27: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 jsonschema 16:27:31 INFO - Using env: {'DISPLAY': ':0', 16:27:31 INFO - 'HOME': '/home/cltbld', 16:27:31 INFO - 'LANG': 'en_US.UTF-8', 16:27:31 INFO - 'LANGUAGE': 'en_US:en', 16:27:31 INFO - 'LOGNAME': 'cltbld', 16:27:31 INFO - 'MAIL': '/var/mail/cltbld', 16:27:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:31 INFO - 'MOZ_NO_REMOTE': '1', 16:27:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:31 INFO - 'NO_EM_RESTART': '1', 16:27:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:31 INFO - 'PWD': '/builds/slave/test', 16:27:31 INFO - 'SHELL': '/bin/bash', 16:27:31 INFO - 'SHLVL': '1', 16:27:31 INFO - 'TERM': 'linux', 16:27:31 INFO - 'TMOUT': '86400', 16:27:31 INFO - 'USER': 'cltbld', 16:27:31 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:31 INFO - '_': '/tools/buildbot/bin/python'} 16:27:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:27:31 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:27:31 INFO - Cleaning up... 16:27:31 INFO - Return code: 0 16:27:31 INFO - Running post-action listener: _resource_record_post_action 16:27:31 INFO - Running post-action listener: _start_resource_monitoring 16:27:31 INFO - Starting resource monitoring. 16:27:31 INFO - [mozharness: 2016-08-01 23:27:31.578831Z] Finished create-virtualenv step (success) 16:27:31 INFO - [mozharness: 2016-08-01 23:27:31.579320Z] Running install step. 16:27:31 INFO - Running pre-action listener: _resource_record_pre_action 16:27:31 INFO - Running main action method: install 16:27:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:27:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:27:31 INFO - Reading from file tmpfile_stdout 16:27:31 INFO - Detecting whether we're running mozinstall >=1.0... 16:27:31 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:27:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:27:31 INFO - Reading from file tmpfile_stdout 16:27:31 INFO - Output received: 16:27:31 INFO - Usage: mozinstall [options] installer 16:27:31 INFO - Options: 16:27:31 INFO - -h, --help show this help message and exit 16:27:31 INFO - -d DEST, --destination=DEST 16:27:31 INFO - Directory to install application into. [default: 16:27:31 INFO - "/builds/slave/test"] 16:27:31 INFO - --app=APP Application being installed. [default: firefox] 16:27:31 INFO - mkdir: /builds/slave/test/build/application 16:27:31 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'] 16:27:31 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 16:27:47 INFO - Reading from file tmpfile_stdout 16:27:47 INFO - Output received: 16:27:47 INFO - /builds/slave/test/build/application/firefox/firefox 16:27:47 INFO - Running post-action listener: _resource_record_post_action 16:27:47 INFO - [mozharness: 2016-08-01 23:27:47.905011Z] Finished install step (success) 16:27:47 INFO - [mozharness: 2016-08-01 23:27:47.905286Z] Running run-tests step. 16:27:47 INFO - Running pre-action listener: _resource_record_pre_action 16:27:47 INFO - Running main action method: run_tests 16:27:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:27:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:27:47 INFO - Python 2.7.3 16:27:47 INFO - Return code: 0 16:27:47 INFO - grabbing minidump binary from tooltool 16:27:47 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')]} 16:27:47 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 0x1d773b0>, '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 0x1d782b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1d78740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:27:47 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 16:27:47 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 16:27:47 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 16:27:47 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:27:47 INFO - Return code: 0 16:27:47 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:27:47 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:27:47 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:27:47 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:27:47 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:27:47 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/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--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 16:27:47 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/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-057 --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 16:27:47 INFO - Using env: {'DISPLAY': ':0', 16:27:47 INFO - 'HOME': '/home/cltbld', 16:27:47 INFO - 'LANG': 'en_US.UTF-8', 16:27:47 INFO - 'LANGUAGE': 'en_US:en', 16:27:47 INFO - 'LOGNAME': 'cltbld', 16:27:47 INFO - 'MAIL': '/var/mail/cltbld', 16:27:47 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:27:47 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:27:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:27:47 INFO - 'MOZ_NO_REMOTE': '1', 16:27:47 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:27:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:27:47 INFO - 'NO_EM_RESTART': '1', 16:27:47 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:27:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:27:47 INFO - 'PWD': '/builds/slave/test', 16:27:47 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:27:47 INFO - 'SHELL': '/bin/bash', 16:27:47 INFO - 'SHLVL': '1', 16:27:47 INFO - 'TERM': 'linux', 16:27:47 INFO - 'TMOUT': '86400', 16:27:47 INFO - 'USER': 'cltbld', 16:27:47 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590', 16:27:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:27:47 INFO - '_': '/tools/buildbot/bin/python'} 16:27:47 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/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--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 16:27:48 INFO - mozversion application_buildid: 20160801155249 16:27:48 INFO - mozversion application_changeset: bdfe8fd853b927c7d4fc3a45237f4cd35e49e86c 16:27:48 INFO - mozversion application_display_name: Nightly 16:27:48 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:27:48 INFO - mozversion application_name: Firefox 16:27:48 INFO - mozversion application_remotingname: firefox 16:27:48 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 16:27:48 INFO - mozversion application_vendor: Mozilla 16:27:48 INFO - mozversion application_version: 50.0a1 16:27:48 INFO - mozversion platform_buildid: 20160801155249 16:27:48 INFO - mozversion platform_changeset: bdfe8fd853b927c7d4fc3a45237f4cd35e49e86c 16:27:48 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 16:27:48 INFO - mozversion platform_version: 50.0a1 16:27:48 INFO - using testdate: 1470094068 16:27:48 INFO - actual date: 1470094068 16:27:48 INFO - starting webserver on 'localhost:32954' 16:27:48 INFO - SUITE-START | Running 2 tests 16:27:48 INFO - TEST-START | dromaeo_css 16:27:48 INFO - operating with platform_type : linux_ 16:27:48 INFO - Initialising browser for dromaeo_css test... 16:27:48 INFO - TEST-INFO | started process 27194 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUQvE6P/profile http://localhost:32954/getInfo.html) 16:27:52 INFO - PROCESS | 27194 | __metrics Screen width/height:1600/1200 16:27:52 INFO - PROCESS | 27194 | colorDepth:24 16:27:52 INFO - PROCESS | 27194 | Browser inner width/height: 1024/697 16:27:52 INFO - PROCESS | 27194 | __metrics 16:27:53 INFO - PROCESS | 27194 | 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" 16:27:53 INFO - PROCESS | 27194 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 122: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:27:54 INFO - TEST-INFO | 27194: exit 0 16:27:54 INFO - Browser initialized. 16:27:54 INFO - Running cycle 1/1 for dromaeo_css test... 16:27:54 INFO - TEST-INFO | started process 27274 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpUQvE6P/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:28:06 INFO - PROCESS | 27274 | RSS: Main: 157609984 16:28:06 INFO - PROCESS | 27274 | 16:28:57 INFO - PROCESS | 27274 | 1470094137260 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] 16:31:10 INFO - PROCESS | 27274 | Cycle 1(1): loaded http://localhost:32954/tests/dromaeo/cssquery-dojo.html (next: http://localhost:32954/tests/dromaeo/cssquery-ext.html) 16:31:11 INFO - PROCESS | 27274 | RSS: Main: 232890368 16:31:11 INFO - PROCESS | 27274 | 16:34:14 INFO - PROCESS | 27274 | Cycle 1(1): loaded http://localhost:32954/tests/dromaeo/cssquery-ext.html (next: http://localhost:32954/tests/dromaeo/cssquery-jquery.html) 16:34:15 INFO - PROCESS | 27274 | RSS: Main: 252874752 16:34:15 INFO - PROCESS | 27274 | 16:37:17 INFO - PROCESS | 27274 | Cycle 1(1): loaded http://localhost:32954/tests/dromaeo/cssquery-jquery.html (next: http://localhost:32954/tests/dromaeo/cssquery-mootools.html) 16:37:17 INFO - PROCESS | 27274 | RSS: Main: 228761600 16:37:17 INFO - PROCESS | 27274 | 16:40:19 INFO - PROCESS | 27274 | Cycle 1(1): loaded http://localhost:32954/tests/dromaeo/cssquery-mootools.html (next: http://localhost:32954/tests/dromaeo/cssquery-prototype.html) 16:40:20 INFO - PROCESS | 27274 | RSS: Main: 189784064 16:40:20 INFO - PROCESS | 27274 | 16:43:23 INFO - PROCESS | 27274 | Cycle 1(1): loaded http://localhost:32954/tests/dromaeo/cssquery-prototype.html (next: http://localhost:32954/tests/dromaeo/cssquery-yui.html) 16:43:24 INFO - PROCESS | 27274 | RSS: Main: 188444672 16:43:24 INFO - PROCESS | 27274 | 16:46:26 INFO - PROCESS | 27274 | Cycle 1(1): loaded http://localhost:32954/tests/dromaeo/cssquery-yui.html (next: http://localhost:32954/tests/dromaeo/cssquery-dojo.html) 16:46:27 INFO - PROCESS | 27274 | RSS: Main: 279166976 16:46:27 INFO - PROCESS | 27274 | 16:46:27 INFO - PROCESS | 27274 | __start_tp_report 16:46:27 INFO - PROCESS | 27274 | _x_x_mozilla_page_load 16:46:27 INFO - PROCESS | 27274 | _x_x_mozilla_page_load_details 16:46:27 INFO - PROCESS | 27274 | |i|pagename|runs| 16:46:27 INFO - PROCESS | 27274 | |0;dojo.html;2646.7088620251775;2656.1367555544452;2682.383051898064;2693.5690289553663;2696.4202696420266;4699.882502937428;4713.34013238147;4798.808047678098;4836.516348365166;4845.2247640377545;4726.9054618907685;4740.644451666121;4766.952330476694;4814.398200224972;4848.2000469922505;4329.653627709791;4350.651947844172;4386.934195987063;4421.624161946238;4528.230200865861;4444.844430444935;4477.5298593647685;4485;4499.820007199708;4516.2548179550495;4321.805518751664;4338.067315527177;4368.322909948963;4369.606735393798;4419.558044195554;4334.869953901357;4381;4387.100644367897;4407.074514351958;4464.7321160730135;4361.193179261815;4444.088961762831;4450.755208463534;4481.170983368087;4488.865334039984;4831.03379324133;4835.685680430761;4843.733594652293;4901.730404827733;4908.975455122737;4996.3504744383;4998.900021999576;5071.315372424712;5140.614453915971;5174.120399532088;5174.327337446146;5183.637145399824;5225.581953443715;5246.527812496855;5251.212318152269;4648.953510464919;4872.220444728861;4886.828960986349;4898.21628539432;4903.53416425439;5217.321748172713;5244.370675518962;5253.185756207794;5338.626296159309;5370.275012873212;5041.420236672756;5105.770240339194;5108.6168537359845;5115.693058416507;5141.742912854343;5126.820561280338;5208.921866172011;5224.085784987688;5226.268322434862;5239.1355426354985;4902.583280421133;4991.650584459126;5031.471695471996;5050.090983622983;5148.716820574829;5059.519345662156;5061.342025536656;5061.645684802103;5061.772220250024;5098.515641014098;4402.25161722508;4404;4405.955940440619;4446.888827779267;4461.263891457938;3735.458358537997;3746.5316835395574;3761.097336639187;3789.0716774390453;3795.9051023724073;4375.146846364992;4414.359917811899;4433.778311084433;4453.888652783707;4455.5989960903025;5150.948490515047;5169.353830771153;5169.870753231199;5171.81898633546;5214.217867319932;4304.4834619845815;4411.029573493826;4417.138657961731;4418.955810441918;4419.977900110479;4554.385158003627;4581.450225972904;4588.197065513588;4662.347271382009;4675.275332323496;4768.046390721869;4776.71339719611;4779.402574678165;4785.521447855187;4825.227963525819;5058.317127187783;5061.645684802029;5070;5070.188769796815;5118.564921981673;4661.557152070548;4760.214564596941;4806.062817750505;4809.5430934061205;4896.706197628154;5053.949460505348;5061.6962982221185;5071.568916642127;5074.2642316864585;5118.667286626357;5095.668781529189;5123.87190320245;5140.7429628517675;5140.871478213075;5148.613853960893;4835.492273311252;4936.407631084293;4978.651494395358;5005.549500544823;5065.8733531662;5036.043151801146;5047;5047.848564543069;5048.949510504848;5095.745212739423;4960.50394960501;4973.9253911190635;5016;5018.723970181675;5024.070546948826;4883;4934.111859865258;5001.024800163933;5012.87467813293;5069.645124841373;4864.173090574682;4877.464078271117;4880.511948805233;4884.145274577006;4918.827841025547 16:46:27 INFO - PROCESS | 27274 | |1;ext.html;568.3464016381164;569.3310360326617;571.3458090486396;574.124460198198;582.2954225387281;29069.999999999975;39373.60626393735;40726.59273407265;40839.183216335696;44180.337294940604;40012.19975600486;40434.19131617366;40440.191196176056;40483.19033619326;40565.79717101411;7488.700451981914;7633.198514156017;7634.236576342377;7635.809104772369;7660.310572048515;7390.778276651682;9786.608535658565;10028.498575071253;10034.648787292446;10349.223808214376;10079.193664506822;10168.389896606228;10170.796584068314;10171.949140254326;10172.38965662059;10018.749531261705;10080.941501142348;10083.44541050242;10088.445135517544;10095.34380265284;9956;10029.69910902674;10034.89965100347;10046.19630429564;10047.24645651579;38908;39198.80400598007;39201.41197882034;39210.41184382208;39345;3088.1507585413965;3162.9525557116663;3396.762226644136;3430.5540279763472;3731.104534911629;28035.29911752202;28424.573631395546;30333.24166895823;30422.84788576065;30995.380092398253;3353.5472711184166;3537.6639219274384;3561.12752375667;3574.2601411154396;3642.0348607619003;258615;263055;263975.6801216001;264230;265109;32567.51148732771;58719;59564;59585.40414595798;59589;33545.83227083849;35391;35411.4688279676;35419.114522137155;35422.46866297007;12868.613941581767;12994.675133121558;13059.477620895248;13060.673483162996;13064.477420903248;9427.811443771223;11024.889751102386;11057;11149.442527873574;11169.944150279196;8004.79988000293;8029.638666260033;8116.173860881373;8121.4721043132;8136.552489613128;3114.9844250779056;3142.5600415941785;3149.1497295730483;3198.3283510462597;3211.6306624737986;856.39624065034;858.9828203435897;866.6576702202594;950.2635457520477;986.9457179855177;28416.28959275993;28702.282442939093;28816.711832881403;29304.12087637374;29386.412271754445;910.7358865928938;921.8202450522084;934.9158575728217;959.2709540749081;1002.0330381182049;14750.082489276325;15000.474983375529;15183.924080379527;15206.543803685907;15290;407232;410216;411524;412143;412174;50730.49269507331;51196.48803511992;51362.48637513577;51364.74317628388;51377.74311128495;1043.4574021508772;1121.4448847820381;1136.085451211766;1165.1319766773809;1167.2062997161672;28058.2985425366;28953.565696514146;29493.115206543836;29783.404331912807;29925.850370748878;42684.57315426806;43202.78398607987;43211.56788432201;43243.35134973041;43270.350944736485;314901;317437;319162;319556;320062;25438.745612543637;26430.86784566065;26545.7345426551;27761.167164985083;27797.16608501748;42183.37303525341;42475.5752442484;42544.36183457312;43036;43962;35754.64245357513;36128.4580731284;36287.27425451529;36574.634253657125;36953.44569831508;36018.8199059003;36076.63923360838;36252.8187359072;36404.27191456209;36566.63433365632;35703.82148089243;35864.28271434505;36018.63981360153;36994.63005369912;39510;31639.841800790848;33191.33617327688;34048.14879628029;34125.82937085299;34229;25116.24651260465;25390.492190156463;25446.618300725135;25507.23478295654;25814.78950652081 16:46:27 INFO - PROCESS | 27274 | |2;jquery.html;337.2378424760042;364.6462930956971;375.23077690734;375.8853549667351;385.18725489217746;12299.446524906378;16850.24173912174;17342.739858902125;18368.26526938921;18533.907330463364;16605.66788664229;16638.584035399123;17417.651646967086;17604;17665.116744162806;5009.323741294924;6633.402993730563;6884.5525040872435;6958.269381714923;7094.11323584552;6958.547694399873;6968.442524598046;6994.160700715921;6997.405220556258;7038.085048943656;6805.965970170167;6967.721291148373;6968.094147760784;6971.825704357407;6972.546784459019;6754.729810807562;7055.894161587555;7060.964695176492;7085.787426377217;7089.7873063808165;6600.471962243009;6771.8984215236815;6807.353301436356;6847.726090956356;6854.383105520527;22772.77227227723;22993.88503057474;23378.76621233783;23382.298531044096;23557;1969.369801663454;2086.968695469554;2095.381862350595;2517.7482251774677;2602.2193341997513;13468.191908485522;14718.92640536801;14776.48282310114;15243;15428.53714388559;1881.74596429483;1889.7732272127432;1926;1939.6217737541185;1945.231633504772;69829.65085174593;79865.60067199684;82700.17299826985;82783;84502.99999999939;16693.83306166923;16702.58243543921;16881.15594220284;17208.741868871977;17298.65402691939;28650.426991460055;28687.56968645472;28728.127187281105;28811.56782648262;28847.71152288492;8778.34162437807;8835;8890.64437422496;9130.771730706652;9243;6885.002417276753;7151.106111736033;7158.06945097134;7444.501084490281;7632.580208088498;8260.504369737715;8413.411061225655;8578.227959483676;8652.956735216283;8707.779516223323;2749.780017598587;2808.304028133015;2834.5039618067167;2886.3794284228993;2940.5442156465783;735.7130719019586;850.8596081646459;856.7044369692446;860.2515811244258;914.0950459045497;16160.030398176146;16794.6641067178;16852.662946740995;17344.913275433795;17832.55418614545;806.4959400374765;810.8054067023871;852.1265702654705;861.4831101339272;883.9779005524913;9073.59168837404;9479.146876780986;9723.076307750753;9729.416235025921;9905.60377584903;378154;382415;383554;384166;393074;76878.23121768823;78405.60797195978;78462.6076869612;78965;82789.58605207056;848.410354803418;867.7873920889297;869.4913475616835;872.3283072034498;874.7506960516349;15245.847541524887;15414.152221627917;15763.448279310169;15838.60403489922;16005.221802020184;34932.301353973286;36091.639083608825;36501.26997460089;36597.268054638225;36839.81580092083;51717.48282517127;52461.21308180457;52540;53053.7347313261;53471.465285348204;7202.423806095395;7653.081630204411;7671.462997590115;7733.535987840747;7886.290233878978;11356;11504.769904602028;12012.459439325427;12261.816072759095;12457.439415226156;10378.27352085377;10401.115905148146;10521.210909181995;10581.841272380767;10770.407627580558;10206.642767503101;10409.271351005356;10638.680839574825;10696.411697356409;10915.781684366428;9729.881063677767;10203.183745300506;10589;10726.93891728254;10870.510827012962;7593.278638529331;7620.923790762243;7652.507760986554;7693.230676932262;7974.162712915292;7773.572453514885;9265.768355791159;10189.03525629818;10544.736381590521;10724.946375268073 16:46:27 INFO - PROCESS | 27274 | |3;mootools.html;1218.5125949620156;1294.7086905446276;1372.9244891530966;1394.3237529798052;1642.72073747463;6370.777022804203;7226.349628533438;7519.962400188005;7535.811604709878;7771.300582947533;7581.583012934287;7612.391008719303;7646.235376462351;7649.04386951631;7650.967119438874;2169.8047175754177;2183.3995651195887;2185.4208634711813;2201.350601572532;2203.526241858;2137.5190582118976;2184.4757258258064;2210.4694873230387;2212.225720997654;2213.269621025058;2157.5253444242244;2169.9240526581575;2179.553191595719;2179.7602263751055;2197.0662468450923;2109.272301056133;2110.3879874836434;2115.756687980871;2116.354511873878;2118.1315660579166;2090.1639344262267;2144.0994782191515;2144.9571008579896;2147.61342958269;2147.967780483294;7324.6337683115635;7454.40364770817;7584.051993500812;7618.6190690465255;7629.847403051964;4419.270820314677;4531.478879928817;4546.045330480603;4552.544745525421;4552.658550608718;2828;2937.206954122375;2965.644122705268;2970.3613723049434;2980.582718419423;870.8824308718368;872.5986046418654;879.8900137482815;887.8268737596171;898.1871406377239;10121.392716437038;10152.543135558917;10178.287519873611;10197.745056373577;10255.487225638688;3760.8495660173285;3961.4057891316534;4010.7794071326357;4115.753054816721;4118.094019315746;7718.884216736754;7720.922790772132;7722.652480638385;7731.188225236382;7735.961320193475;4412.823487060482;4420.823167073346;4430.800613972379;4434.379186913835;4434.800433980478;3553.7690050147175;4057.4522439470293;4132.33882578792;4134.37984302351;4206.326987681956;3277.852496637657;3310.453775127125;3416.0435078178148;3443.6384179660777;3447.931041379158;971.8736564246602;996.875390576178;1002.4937406609615;1007.5969612155196;1019.1337363241333;609.8658295175143;615.7536985205863;720.4020662849822;751.5340488896919;753.156464759462;4800.423949126127;4859.052484765508;4996.4503904570465;5007.774650140753;5044.117279476077;375.78204641307974;382.80285652888784;387.46336324191196;390.3442217075341;890.528020149322;3237.14215732831;3257.7068063874367;3288.408086544445;3355.9496607550905;3496.3182179474757;9116.772080698036;9534.189593884597;9534.237261019101;9547.761305967268;9562.139407453362;9385.906140938503;9418.152366287068;9423.717288481357;9435.29235307341;9456.905430945602;7075.080239568823;7156.964215178891;7176.605286709177;7178.856422871513;7214.531055481377;5086;5251.501107394792;5314.97342513285;5446.509814116748;5504.944950550604;8593.269572086443;8623.223909848144;8628.611712472828;8650.43772154808;8681.696140635047;8525.914740852511;8685.478871267744;8731.126887311219;8876.02363740001;8911.197992180734;5503.284573005483;6323.6838158090995;6475.158229430144;6555.311692272243;6571.408573228432;7171.42628589722;7552.433567482351;7560.054993125859;7562.508436951581;7565.394768418623;6507.023946408077;6579.868402631825;6621.735130594915;6726.932730672631;6860.176778786577;6468.870622587616;6507.934920650733;6625.801225963229;6645.800625981228;6711.865762684622;6196.225471816023;6286.622802631674;6295.150154729053;6300.810975670737;6311.147995020613;4422.380866678732;4428.070105277928;4555.134524440346;4578.954210457986;4604.953950460453;4274.294741367639;4454.398656181504;4460.620847228022;4495.662825288182;4520.118576877478 16:46:27 INFO - PROCESS | 27274 | |4;prototype.html;294.7465179945247;296.8441568176707;300.2433866656028;304.4459084466272;305.8088694565896;4885.267209918509;4915.272024026673;4953.504649535049;4953.854302517909;4962.354893863797;4827;4840.298156767267;4867.172580661288;4873.22028475444;4889.364382630262;3643.253133107713;3753.6058713835064;3785.167263202091;3830.9425358619505;3864.9227015459815;3824.7513911595797;3854.537455505343;3866.0721426857494;3890.435886796413;3909.3940439231965;3793.108619474421;3797.3354662934016;3798.3922572388424;3813;3820.522434695663;3617.421212605984;3680.9263814723554;3787.621237876218;3790.9431358529646;3833.5399752029657;3345.698887100148;3354.9702430029724;3358.932821343584;3370.3933292007428;3406.880759173417;4688.7186768793645;4712.687890580115;4714.669973101884;4716.174669432869;4755.881102972418;4167.541360523823;4331.220380331539;4384.912301753979;4387.912241755147;4390.978045109786;4965.280034394992;5032.723200223986;5046.419661738873;5047.066292735819;5049.141645920203;3701.0932321581386;3703.148275896532;3703.925921481555;3713.57293911201;3713.628637136265;5064.924026139574;5257.5005374489365;5272.420033796279;5288.81489147878;5305.124654432014;3726.31063253299;3754.723394045983;3754.981225093857;3760.0975765816556;3770.5098337216536;3813.580506144322;3813.7902415366866;3815.7138214634015;3833.4824798651825;3842.3852183650483;4335.089631177425;4342.413774140514;4343.695941284143;4356.934645980313;4360.781960902005;4809.470958194595;5034.647574669738;5071.137906555894;5107.284980102789;5126.871828204325;1324.2385628263787;1331.3210262766058;1331.5406184866206;1334.5129027904939;1336.3117994232978;820.9753707388788;853.1255463150196;868.887044684187;877.0834477970536;883.1433509495779;4316.525182229952;4405.383246345515;4473.194824931478;4508.436445444319;4527.547245275512;5245.1345527988215;5250.18622113573;5255.264263003182;5264.447233040552;5292.867678308073;4500.627308670822;4505.932411013838;4516.728996260234;4531.297648864365;4555.589996900295;2624.8950041998105;2770.2104900103373;2773.5839624056553;2779.7915156363356;2782.2348854065294;4912.4350699669285;4948.4061912570005;4955.554000140005;4955.900881982412;4961.90076198474;5073.923891141636;5306.97346513265;5338.199270109515;5341.439148889388;5369.624126311199;4906.552566992746;4934.950650493521;4952.306677065214;4954.9752251238515;4972.190712247569;5177.663451875616;5216.6348355616265;5238.371395432572;5238.895222095613;5284.8901730637;4974.801007959641;5135.38375394955;5149.948500514947;5156.587473002076;5175.404828444777;4883.755812209304;4895.608351331956;4906.533879281463;4908.631852610997;4933.210686290176;3800.7909564974193;3814.3706288462095;3822.4266360046217;3827.578966313759;3833.6358045985585;5016.673916195436;5260.500252476008;5269.1569348903995;5273.947260527346;5284.678830292427;5054.721990290569;5078.898422031465;5092.516210959953;5093.2105523643895;5152.458991805806;5070.315507406601;5110.744462776921;5118.129917914038;5124.231365295235;5178.197379406198;4860.222364421676;4991.477599332238;5086.847394578169;5087;5094.51602097815;4879.609631229564;4987.177115775857;5085.440601533903;5101;5113.897722045613;4975.402951645681;4980.477049909852;4988.376452943382;4997.350344455198;5066.518680725325 16:46:27 INFO - PROCESS | 27274 | |5;yui.html;588.7792077970761;643.4562794438698;648.9716371694547;685.8593988232416;686.9793906182816;11802.940985295072;13444.596662100153;13547.119437236574;13589.184648921058;13611.319434028308;13288.667783305422;13450.663733406669;13462.1922684639;13484.123531970416;13485.730285394286;612.6722203621064;751.4814777803311;759.9506032107923;762.5196126440335;763.5914785589711;745.4856149257023;772.671614563811;774.9535027898316;777.6772639354662;778.5367706214793;796.5459687977855;812.0134037144868;812.3501199040774;812.9187081291853;813.3168138763438;636.045931103345;808.1352952340998;809.9433039687253;810.4488947515687;811.6185392865344;557.7490129441768;575.0253320621548;579.6637949988997;582.9533637309005;583.6848102024901;12609.684757881127;12617.179883307555;12639.115261931669;12647.367631618474;12680.239185648798;11370.545178192862;11786.764264714659;11917.165798394115;11967.521299148024;12478.937605311916;10419.843702344471;10561.947190264076;10603.363798172135;10656.62701805433;10664.306820056672;3772.5472943246714;3810.618938106195;3832.7508711933633;3834.9808250958845;3949.5063117110362;62993.685031575005;63189.68405157945;63302.68348658273;64189.35810641927;64449.3555064448;9239.491827949527;9252.398594091363;9265.953670231605;9291.442513449214;9407.106324899123;17266;17440.738388924176;17612.20745066475;17677.11614419274;17756.46730598084;6385.233771947396;6503.2521260054755;6598.73605055802;6699.698513566901;6743.291954344723;3418.179636887129;3419.794812311269;3441.535392722001;3493.12671832042;3549.5563054618174;2647.8543680097778;2738.986305068462;2784.359597292634;2790.693023767384;2977.330100727319;542.9348478182643;548.8298627425511;548.8435795798258;549.0282200505163;555.0370107862855;418.811534809337;549.8130635583841;559.6628204242379;571.0691572736413;586.4897539140975;7434.888476672854;7766.301032907066;7991.320737737357;8119.431639785158;8187.672493100328;448.9506154323022;460.2153328574772;496.2506615011359;526.394646156915;555.6832605414875;3772.679322257639;3866.7873266970587;3898.8440462381186;3986.631296554407;3999.8200080996426;104172.47913760383;106021.46989265004;108812;109463;113952;52395.47604523906;85901;86817.56591217003;87354;88563;77622;78863;79495;80102.5994870022;81233;7340.449466289942;7634.770956871303;7654.73208437702;7705.383569314554;7921.762347129596;46324.7683761579;48225.75887120542;49380.753096234286;49601.7725612311;50419;37812.43281350727;43124;52427;59685;61099.69450152721;9828.705138845846;10163.44101074448;10281.691549253534;10477.109445696897;10531;11464.140189485655;11665.125115616192;11891;11943.283402995501;12638.43127059303;10676.946615266874;10875.347479151276;10956.616518421817;11067.557297708323;11204.887951120385;10708.089812366035;10944.124470042536;11342.319460832376;11360.54557817711;11446.771064578828;10644.946775266075;10682.09202217789;10688.412137332522;11040.392778396945;11324.37715925632;9237.168654821098;9613.375130616487;9639.084286992724;9735.756606084904;10034.548445320124;9117.316201284797;9822.165115964937;9864.85202721974;9913.206943444651;9928.222510218266 16:46:27 INFO - PROCESS | 27274 | __end_tp_report 16:46:27 INFO - PROCESS | 27274 | __start_cc_report 16:46:27 INFO - PROCESS | 27274 | _x_x_mozilla_cycle_collect,1103 16:46:27 INFO - PROCESS | 27274 | __end_cc_report 16:46:27 INFO - PROCESS | 27274 | __startTimestamp1470095187235__endTimestamp 16:46:27 INFO - PROCESS | 27274 | 16:46:27 INFO - PROCESS | 27274 | ------- Summary: start ------- 16:46:27 INFO - PROCESS | 27274 | Number of tests: 6 16:46:27 INFO - PROCESS | 27274 | 16:46:27 INFO - PROCESS | 27274 | [#0] dojo.html Cycles:165 Average:4743.83 Median:4880.51 stddev:500.44 (10.3%) stddev-sans-first:474.17 16:46:27 INFO - PROCESS | 27274 | Values: 2646.7 2656.1 2682.4 2693.6 2696.4 4699.9 4713.3 4798.8 4836.5 4845.2 4726.9 4740.6 4767.0 4814.4 4848.2 4329.7 4350.7 4386.9 4421.6 4528.2 4444.8 4477.5 4485.0 4499.8 4516.3 4321.8 4338.1 4368.3 4369.6 4419.6 4334.9 4381.0 4387.1 4407.1 4464.7 4361.2 4444.1 4450.8 4481.2 4488.9 4831.0 4835.7 4843.7 4901.7 4909.0 4996.4 4998.9 5071.3 5140.6 5174.1 5174.3 5183.6 5225.6 5246.5 5251.2 4649.0 4872.2 4886.8 4898.2 4903.5 5217.3 5244.4 5253.2 5338.6 5370.3 5041.4 5105.8 5108.6 5115.7 5141.7 5126.8 5208.9 5224.1 5226.3 5239.1 4902.6 4991.7 5031.5 5050.1 5148.7 5059.5 5061.3 5061.6 5061.8 5098.5 4402.3 4404.0 4406.0 4446.9 4461.3 3735.5 3746.5 3761.1 3789.1 3795.9 4375.1 4414.4 4433.8 4453.9 4455.6 5150.9 5169.4 5169.9 5171.8 5214.2 4304.5 4411.0 4417.1 4419.0 4420.0 4554.4 4581.5 4588.2 4662.3 4675.3 4768.0 4776.7 4779.4 4785.5 4825.2 5058.3 5061.6 5070.0 5070.2 5118.6 4661.6 4760.2 4806.1 4809.5 4896.7 5053.9 5061.7 5071.6 5074.3 5118.7 5095.7 5123.9 5140.7 5140.9 5148.6 4835.5 4936.4 4978.7 5005.5 5065.9 5036.0 5047.0 5047.8 5048.9 5095.7 4960.5 4973.9 5016.0 5018.7 5024.1 4883.0 4934.1 5001.0 5012.9 5069.6 4864.2 4877.5 4880.5 4884.1 4918.8 16:46:27 INFO - PROCESS | 27274 | 16:46:27 INFO - PROCESS | 27274 | [#1] ext.html Cycles:180 Average:47981.83 Median:19464.33 stddev:88690.79 (455.7%) stddev-sans-first:88868.15 16:46:27 INFO - PROCESS | 27274 | Values: 568.3 569.3 571.3 574.1 582.3 29070.0 39373.6 40726.6 40839.2 44180.3 40012.2 40434.2 40440.2 40483.2 40565.8 7488.7 7633.2 7634.2 7635.8 7660.3 7390.8 9786.6 10028.5 10034.6 10349.2 10079.2 10168.4 10170.8 10171.9 10172.4 10018.7 10080.9 10083.4 10088.4 10095.3 9956.0 10029.7 10034.9 10046.2 10047.2 38908.0 39198.8 39201.4 39210.4 39345.0 3088.2 3163.0 3396.8 3430.6 3731.1 28035.3 28424.6 30333.2 30422.8 30995.4 3353.5 3537.7 3561.1 3574.3 3642.0 258615.0 263055.0 263975.7 264230.0 265109.0 32567.5 58719.0 59564.0 59585.4 59589.0 33545.8 35391.0 35411.5 35419.1 35422.5 12868.6 12994.7 13059.5 13060.7 13064.5 9427.8 11024.9 11057.0 11149.4 11169.9 8004.8 8029.6 8116.2 8121.5 8136.6 3115.0 3142.6 3149.1 3198.3 3211.6 856.4 859.0 866.7 950.3 986.9 28416.3 28702.3 28816.7 29304.1 29386.4 910.7 921.8 934.9 959.3 1002.0 14750.1 15000.5 15183.9 15206.5 15290.0 407232.0 410216.0 411524.0 412143.0 412174.0 50730.5 51196.5 51362.5 51364.7 51377.7 1043.5 1121.4 1136.1 1165.1 1167.2 28058.3 28953.6 29493.1 29783.4 29925.9 42684.6 43202.8 43211.6 43243.4 43270.4 314901.0 317437.0 319162.0 319556.0 320062.0 25438.7 26430.9 26545.7 27761.2 27797.2 42183.4 42475.6 42544.4 43036.0 43962.0 35754.6 36128.5 36287.3 36574.6 36953.4 36018.8 36076.6 36252.8 36404.3 36566.6 35703.8 35864.3 36018.6 36994.6 39510.0 31639.8 33191.3 34048.1 34125.8 34229.0 25116.2 25390.5 25446.6 25507.2 25814.8 16:46:27 INFO - PROCESS | 27274 | 16:46:27 INFO - PROCESS | 27274 | [#2] jquery.html Cycles:180 Average:25813.73 Median:196729.59 stddev:63572.45 (32.3%) stddev-sans-first:63722.01 16:46:27 INFO - PROCESS | 27274 | Values: 337.2 364.6 375.2 375.9 385.2 12299.4 16850.2 17342.7 18368.3 18533.9 16605.7 16638.6 17417.7 17604.0 17665.1 5009.3 6633.4 6884.6 6958.3 7094.1 6958.5 6968.4 6994.2 6997.4 7038.1 6806.0 6967.7 6968.1 6971.8 6972.5 6754.7 7055.9 7061.0 7085.8 7089.8 6600.5 6771.9 6807.4 6847.7 6854.4 22772.8 22993.9 23378.8 23382.3 23557.0 1969.4 2087.0 2095.4 2517.7 2602.2 13468.2 14718.9 14776.5 15243.0 15428.5 1881.7 1889.8 1926.0 1939.6 1945.2 69829.7 79865.6 82700.2 82783.0 84503.0 16693.8 16702.6 16881.2 17208.7 17298.7 28650.4 28687.6 28728.1 28811.6 28847.7 8778.3 8835.0 8890.6 9130.8 9243.0 6885.0 7151.1 7158.1 7444.5 7632.6 8260.5 8413.4 8578.2 8653.0 8707.8 2749.8 2808.3 2834.5 2886.4 2940.5 735.7 850.9 856.7 860.3 914.1 16160.0 16794.7 16852.7 17344.9 17832.6 806.5 810.8 852.1 861.5 884.0 9073.6 9479.1 9723.1 9729.4 9905.6 378154.0 382415.0 383554.0 384166.0 393074.0 76878.2 78405.6 78462.6 78965.0 82789.6 848.4 867.8 869.5 872.3 874.8 15245.8 15414.2 15763.4 15838.6 16005.2 34932.3 36091.6 36501.3 36597.3 36839.8 51717.5 52461.2 52540.0 53053.7 53471.5 7202.4 7653.1 7671.5 7733.5 7886.3 11356.0 11504.8 12012.5 12261.8 12457.4 10378.3 10401.1 10521.2 10581.8 10770.4 10206.6 10409.3 10638.7 10696.4 10915.8 9729.9 10203.2 10589.0 10726.9 10870.5 7593.3 7620.9 7652.5 7693.2 7974.2 7773.6 9265.8 10189.0 10544.7 10724.9 16:46:27 INFO - PROCESS | 27274 | 16:46:27 INFO - PROCESS | 27274 | [#3] mootools.html Cycles:180 Average:4948.15 Median:5025.95 stddev:2784.93 (55.4%) stddev-sans-first:2778.63 16:46:27 INFO - PROCESS | 27274 | Values: 1218.5 1294.7 1372.9 1394.3 1642.7 6370.8 7226.3 7520.0 7535.8 7771.3 7581.6 7612.4 7646.2 7649.0 7651.0 2169.8 2183.4 2185.4 2201.4 2203.5 2137.5 2184.5 2210.5 2212.2 2213.3 2157.5 2169.9 2179.6 2179.8 2197.1 2109.3 2110.4 2115.8 2116.4 2118.1 2090.2 2144.1 2145.0 2147.6 2148.0 7324.6 7454.4 7584.1 7618.6 7629.8 4419.3 4531.5 4546.0 4552.5 4552.7 2828.0 2937.2 2965.6 2970.4 2980.6 870.9 872.6 879.9 887.8 898.2 10121.4 10152.5 10178.3 10197.7 10255.5 3760.8 3961.4 4010.8 4115.8 4118.1 7718.9 7720.9 7722.7 7731.2 7736.0 4412.8 4420.8 4430.8 4434.4 4434.8 3553.8 4057.5 4132.3 4134.4 4206.3 3277.9 3310.5 3416.0 3443.6 3447.9 971.9 996.9 1002.5 1007.6 1019.1 609.9 615.8 720.4 751.5 753.2 4800.4 4859.1 4996.5 5007.8 5044.1 375.8 382.8 387.5 390.3 890.5 3237.1 3257.7 3288.4 3355.9 3496.3 9116.8 9534.2 9534.2 9547.8 9562.1 9385.9 9418.2 9423.7 9435.3 9456.9 7075.1 7157.0 7176.6 7178.9 7214.5 5086.0 5251.5 5315.0 5446.5 5504.9 8593.3 8623.2 8628.6 8650.4 8681.7 8525.9 8685.5 8731.1 8876.0 8911.2 5503.3 6323.7 6475.2 6555.3 6571.4 7171.4 7552.4 7560.1 7562.5 7565.4 6507.0 6579.9 6621.7 6726.9 6860.2 6468.9 6507.9 6625.8 6645.8 6711.9 6196.2 6286.6 6295.2 6300.8 6311.1 4422.4 4428.1 4555.1 4579.0 4605.0 4274.3 4454.4 4460.6 4495.7 4520.1 16:46:27 INFO - PROCESS | 27274 | 16:46:27 INFO - PROCESS | 27274 | [#4] prototype.html Cycles:180 Average:4237.37 Median:4876.41 stddev:1219.69 (25.0%) stddev-sans-first:1186.67 16:46:27 INFO - PROCESS | 27274 | Values: 294.7 296.8 300.2 304.4 305.8 4885.3 4915.3 4953.5 4953.9 4962.4 4827.0 4840.3 4867.2 4873.2 4889.4 3643.3 3753.6 3785.2 3830.9 3864.9 3824.8 3854.5 3866.1 3890.4 3909.4 3793.1 3797.3 3798.4 3813.0 3820.5 3617.4 3680.9 3787.6 3790.9 3833.5 3345.7 3355.0 3358.9 3370.4 3406.9 4688.7 4712.7 4714.7 4716.2 4755.9 4167.5 4331.2 4384.9 4387.9 4391.0 4965.3 5032.7 5046.4 5047.1 5049.1 3701.1 3703.1 3703.9 3713.6 3713.6 5064.9 5257.5 5272.4 5288.8 5305.1 3726.3 3754.7 3755.0 3760.1 3770.5 3813.6 3813.8 3815.7 3833.5 3842.4 4335.1 4342.4 4343.7 4356.9 4360.8 4809.5 5034.6 5071.1 5107.3 5126.9 1324.2 1331.3 1331.5 1334.5 1336.3 821.0 853.1 868.9 877.1 883.1 4316.5 4405.4 4473.2 4508.4 4527.5 5245.1 5250.2 5255.3 5264.4 5292.9 4500.6 4505.9 4516.7 4531.3 4555.6 2624.9 2770.2 2773.6 2779.8 2782.2 4912.4 4948.4 4955.6 4955.9 4961.9 5073.9 5307.0 5338.2 5341.4 5369.6 4906.6 4935.0 4952.3 4955.0 4972.2 5177.7 5216.6 5238.4 5238.9 5284.9 4974.8 5135.4 5149.9 5156.6 5175.4 4883.8 4895.6 4906.5 4908.6 4933.2 3800.8 3814.4 3822.4 3827.6 3833.6 5016.7 5260.5 5269.2 5273.9 5284.7 5054.7 5078.9 5092.5 5093.2 5152.5 5070.3 5110.7 5118.1 5124.2 5178.2 4860.2 4991.5 5086.8 5087.0 5094.5 4879.6 4987.2 5085.4 5101.0 5113.9 4975.4 4980.5 4988.4 4997.4 5066.5 16:46:27 INFO - PROCESS | 27274 | 16:46:27 INFO - PROCESS | 27274 | [#5] yui.html Cycles:180 Average:17682.72 Median:51407.24 stddev:26290.23 (51.1%) stddev-sans-first:26332.65 16:46:27 INFO - PROCESS | 27274 | Values: 588.8 643.5 649.0 685.9 687.0 11802.9 13444.6 13547.1 13589.2 13611.3 13288.7 13450.7 13462.2 13484.1 13485.7 612.7 751.5 760.0 762.5 763.6 745.5 772.7 775.0 777.7 778.5 796.5 812.0 812.4 812.9 813.3 636.0 808.1 809.9 810.4 811.6 557.7 575.0 579.7 583.0 583.7 12609.7 12617.2 12639.1 12647.4 12680.2 11370.5 11786.8 11917.2 11967.5 12478.9 10419.8 10561.9 10603.4 10656.6 10664.3 3772.5 3810.6 3832.8 3835.0 3949.5 62993.7 63189.7 63302.7 64189.4 64449.4 9239.5 9252.4 9266.0 9291.4 9407.1 17266.0 17440.7 17612.2 17677.1 17756.5 6385.2 6503.3 6598.7 6699.7 6743.3 3418.2 3419.8 3441.5 3493.1 3549.6 2647.9 2739.0 2784.4 2790.7 2977.3 542.9 548.8 548.8 549.0 555.0 418.8 549.8 559.7 571.1 586.5 7434.9 7766.3 7991.3 8119.4 8187.7 449.0 460.2 496.3 526.4 555.7 3772.7 3866.8 3898.8 3986.6 3999.8 104172.5 106021.5 108812.0 109463.0 113952.0 52395.5 85901.0 86817.6 87354.0 88563.0 77622.0 78863.0 79495.0 80102.6 81233.0 7340.4 7634.8 7654.7 7705.4 7921.8 46324.8 48225.8 49380.8 49601.8 50419.0 37812.4 43124.0 52427.0 59685.0 61099.7 9828.7 10163.4 10281.7 10477.1 10531.0 11464.1 11665.1 11891.0 11943.3 12638.4 10676.9 10875.3 10956.6 11067.6 11204.9 10708.1 10944.1 11342.3 11360.5 11446.8 10644.9 10682.1 10688.4 11040.4 11324.4 9237.2 9613.4 9639.1 9735.8 10034.5 9117.3 9822.2 9864.9 9913.2 9928.2 16:46:27 INFO - PROCESS | 27274 | -------- Summary: end -------- 16:46:27 INFO - PROCESS | 27274 | 16:46:28 INFO - TEST-INFO | 27274: exit 0 16:46:28 INFO - TEST-OK | dromaeo_css | took 1119899ms 16:46:28 INFO - TEST-START | kraken 16:46:28 INFO - operating with platform_type : linux_ 16:46:28 INFO - Initialising browser for kraken test... 16:46:28 INFO - TEST-INFO | started process 27458 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5gNLYl/profile http://localhost:32954/getInfo.html) 16:46:32 INFO - PROCESS | 27458 | __metrics Screen width/height:1600/1200 16:46:32 INFO - PROCESS | 27458 | colorDepth:24 16:46:32 INFO - PROCESS | 27458 | Browser inner width/height: 1024/697 16:46:32 INFO - PROCESS | 27458 | __metrics 16:46:33 INFO - PROCESS | 27458 | 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" 16:46:33 INFO - PROCESS | 27458 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 122: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 16:46:34 INFO - TEST-INFO | 27458: exit 0 16:46:34 INFO - Browser initialized. 16:46:34 INFO - Running cycle 1/1 for kraken test... 16:46:34 INFO - TEST-INFO | started process 27536 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp5gNLYl/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:46:46 INFO - PROCESS | 27536 | RSS: Main: 157868032 16:46:46 INFO - PROCESS | 27536 | 16:46:48 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:32954/tests/kraken/driver.html?testName=audio-beat-detection) 16:46:49 INFO - PROCESS | 27536 | RSS: Main: 214044672 16:46:49 INFO - PROCESS | 27536 | 16:46:52 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:32954/tests/kraken/driver.html?testName=audio-dft) 16:46:53 INFO - PROCESS | 27536 | RSS: Main: 191582208 16:46:53 INFO - PROCESS | 27536 | 16:46:56 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:32954/tests/kraken/driver.html?testName=audio-fft) 16:46:57 INFO - PROCESS | 27536 | RSS: Main: 270782464 16:46:57 INFO - PROCESS | 27536 | 16:46:59 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:32954/tests/kraken/driver.html?testName=audio-oscillator) 16:46:59 INFO - PROCESS | 27536 | RSS: Main: 180531200 16:46:59 INFO - PROCESS | 27536 | 16:47:02 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:32954/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:47:02 INFO - PROCESS | 27536 | RSS: Main: 185421824 16:47:02 INFO - PROCESS | 27536 | 16:47:05 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:32954/tests/kraken/driver.html?testName=imaging-darkroom) 16:47:06 INFO - PROCESS | 27536 | RSS: Main: 222068736 16:47:06 INFO - PROCESS | 27536 | 16:47:09 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:32954/tests/kraken/driver.html?testName=imaging-desaturate) 16:47:10 INFO - PROCESS | 27536 | RSS: Main: 215519232 16:47:10 INFO - PROCESS | 27536 | 16:47:13 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:32954/tests/kraken/driver.html?testName=json-parse-financial) 16:47:14 INFO - PROCESS | 27536 | RSS: Main: 219090944 16:47:14 INFO - PROCESS | 27536 | 16:47:15 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:32954/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:47:16 INFO - PROCESS | 27536 | RSS: Main: 184541184 16:47:16 INFO - PROCESS | 27536 | 16:47:18 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:32954/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:47:18 INFO - PROCESS | 27536 | RSS: Main: 189685760 16:47:18 INFO - PROCESS | 27536 | 16:47:21 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:32954/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:47:21 INFO - PROCESS | 27536 | RSS: Main: 194576384 16:47:21 INFO - PROCESS | 27536 | 16:47:24 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:32954/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:47:25 INFO - PROCESS | 27536 | RSS: Main: 189292544 16:47:25 INFO - PROCESS | 27536 | 16:47:28 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:32954/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:47:28 INFO - PROCESS | 27536 | RSS: Main: 192983040 16:47:28 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | Cycle 1(1): loaded http://localhost:32954/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:32954/tests/kraken/driver.html?testName=ai-astar) 16:47:30 INFO - PROCESS | 27536 | RSS: Main: 243605504 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | __start_tp_report 16:47:30 INFO - PROCESS | 27536 | _x_x_mozilla_page_load 16:47:30 INFO - PROCESS | 27536 | _x_x_mozilla_page_load_details 16:47:30 INFO - PROCESS | 27536 | |i|pagename|runs| 16:47:30 INFO - PROCESS | 27536 | |0;ai-astar;105;114;114;115;113;113;113;112;114;113 16:47:30 INFO - PROCESS | 27536 | |1;audio-beat-detection;148;123;127;183;124;125;162;123;182;124 16:47:30 INFO - PROCESS | 27536 | |2;audio-dft;161;162;160;160;161;162;161;161;162;162 16:47:30 INFO - PROCESS | 27536 | |3;audio-fft;75;77;76;118;75;77;75;77;100;75 16:47:30 INFO - PROCESS | 27536 | |4;audio-oscillator;85;85;121;88;84;86;117;84;85;120 16:47:30 INFO - PROCESS | 27536 | |5;imaging-gaussian-blur;116;117;117;117;118;116;116;117;117;116 16:47:30 INFO - PROCESS | 27536 | |6;imaging-darkroom;146;145;147;146;147;146;147;147;147;147 16:47:30 INFO - PROCESS | 27536 | |7;imaging-desaturate;95;94;95;95;95;95;95;95;95;95 16:47:30 INFO - PROCESS | 27536 | |8;json-parse-financial;63;61;62;61;60;63;62;61;62;62 16:47:30 INFO - PROCESS | 27536 | |9;json-stringify-tinderbox;66;66;65;65;65;65;65;65;69;66 16:47:30 INFO - PROCESS | 27536 | |10;stanford-crypto-aes;78;79;79;79;80;79;79;81;79;86 16:47:30 INFO - PROCESS | 27536 | |11;stanford-crypto-ccm;133;134;132;141;129;128;128;131;162;140 16:47:30 INFO - PROCESS | 27536 | |12;stanford-crypto-pbkdf2;171;165;175;164;170;168;169;170;172;166 16:47:30 INFO - PROCESS | 27536 | |13;stanford-crypto-sha256-iterative;68;68;67;66;67;68;66;68;67;66 16:47:30 INFO - PROCESS | 27536 | __end_tp_report 16:47:30 INFO - PROCESS | 27536 | __start_cc_report 16:47:30 INFO - PROCESS | 27536 | _x_x_mozilla_cycle_collect,1900 16:47:30 INFO - PROCESS | 27536 | __end_cc_report 16:47:30 INFO - PROCESS | 27536 | __startTimestamp1470095250650__endTimestamp 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | ------- Summary: start ------- 16:47:30 INFO - PROCESS | 27536 | Number of tests: 14 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#0] ai-astar Cycles:10 Average:112.60 Median:113.50 stddev:2.80 (2.5%) stddev-sans-first:0.88 16:47:30 INFO - PROCESS | 27536 | Values: 105.0 114.0 114.0 115.0 113.0 113.0 113.0 112.0 114.0 113.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#1] audio-beat-detection Cycles:10 Average:142.10 Median:137.50 stddev:24.95 (18.1%) stddev-sans-first:26.37 16:47:30 INFO - PROCESS | 27536 | Values: 148.0 123.0 127.0 183.0 124.0 125.0 162.0 123.0 182.0 124.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#2] audio-dft Cycles:10 Average:161.20 Median:161.50 stddev:0.79 (0.5%) stddev-sans-first:0.83 16:47:30 INFO - PROCESS | 27536 | Values: 161.0 162.0 160.0 160.0 161.0 162.0 161.0 161.0 162.0 162.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#3] audio-fft Cycles:10 Average:82.50 Median:75.50 stddev:14.62 (19.4%) stddev-sans-first:15.26 16:47:30 INFO - PROCESS | 27536 | Values: 75.0 77.0 76.0 118.0 75.0 77.0 75.0 77.0 100.0 75.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#4] audio-oscillator Cycles:10 Average:95.50 Median:85.00 stddev:16.51 (19.4%) stddev-sans-first:17.07 16:47:30 INFO - PROCESS | 27536 | Values: 85.0 85.0 121.0 88.0 84.0 86.0 117.0 84.0 85.0 120.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.67 (0.6%) stddev-sans-first:0.67 16:47:30 INFO - PROCESS | 27536 | Values: 116.0 117.0 117.0 117.0 118.0 116.0 116.0 117.0 117.0 116.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#6] imaging-darkroom Cycles:10 Average:146.50 Median:147.00 stddev:0.71 (0.5%) stddev-sans-first:0.73 16:47:30 INFO - PROCESS | 27536 | Values: 146.0 145.0 147.0 146.0 147.0 146.0 147.0 147.0 147.0 147.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#7] imaging-desaturate Cycles:10 Average:94.90 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 16:47:30 INFO - PROCESS | 27536 | Values: 95.0 94.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#8] json-parse-financial Cycles:10 Average:61.70 Median:62.00 stddev:0.95 (1.5%) stddev-sans-first:0.88 16:47:30 INFO - PROCESS | 27536 | Values: 63.0 61.0 62.0 61.0 60.0 63.0 62.0 61.0 62.0 62.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#9] json-stringify-tinderbox Cycles:10 Average:65.70 Median:65.50 stddev:1.25 (1.9%) stddev-sans-first:1.32 16:47:30 INFO - PROCESS | 27536 | Values: 66.0 66.0 65.0 65.0 65.0 65.0 65.0 65.0 69.0 66.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#10] stanford-crypto-aes Cycles:10 Average:79.90 Median:79.00 stddev:2.28 (2.9%) stddev-sans-first:2.32 16:47:30 INFO - PROCESS | 27536 | Values: 78.0 79.0 79.0 79.0 80.0 79.0 79.0 81.0 79.0 86.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#11] stanford-crypto-ccm Cycles:10 Average:135.80 Median:133.50 stddev:10.26 (7.7%) stddev-sans-first:10.83 16:47:30 INFO - PROCESS | 27536 | Values: 133.0 134.0 132.0 141.0 129.0 128.0 128.0 131.0 162.0 140.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:169.00 Median:170.00 stddev:3.37 (2.0%) stddev-sans-first:3.49 16:47:30 INFO - PROCESS | 27536 | Values: 171.0 165.0 175.0 164.0 170.0 168.0 169.0 170.0 172.0 166.0 16:47:30 INFO - PROCESS | 27536 | 16:47:30 INFO - PROCESS | 27536 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.10 Median:67.50 stddev:0.88 (1.3%) stddev-sans-first:0.87 16:47:30 INFO - PROCESS | 27536 | Values: 68.0 68.0 67.0 66.0 67.0 68.0 66.0 68.0 67.0 66.0 16:47:30 INFO - PROCESS | 27536 | -------- Summary: end -------- 16:47:30 INFO - PROCESS | 27536 | 16:47:31 INFO - TEST-INFO | 27536: exit 0 16:47:31 INFO - TEST-OK | kraken | took 63708ms 16:47:31 INFO - SUITE-END | took 1183s 16:47:31 INFO - Completed test suite (00:19:43) 16:47:31 INFO - javascript benchmark 16:47:31 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2646.7088620251775, 2656.1367555544452, 2682.383051898064, 2693.5690289553663, 2696.4202696420266, 4699.882502937428, 4713.34013238147, 4798.808047678098, 4836.516348365166, 4845.2247640377545, 4726.9054618907685, 4740.644451666121, 4766.952330476694, 4814.398200224972, 4848.2000469922505, 4329.653627709791, 4350.651947844172, 4386.934195987063, 4421.624161946238, 4528.230200865861, 4444.844430444935, 4477.5298593647685, 4485.0, 4499.820007199708, 4516.2548179550495, 4321.805518751664, 4338.067315527177, 4368.322909948963, 4369.606735393798, 4419.558044195554, 4334.869953901357, 4381.0, 4387.100644367897, 4407.074514351958, 4464.7321160730135, 4361.193179261815, 4444.088961762831, 4450.755208463534, 4481.170983368087, 4488.865334039984, 4831.03379324133, 4835.685680430761, 4843.733594652293, 4901.730404827733, 4908.975455122737, 4996.3504744383, 4998.900021999576, 5071.315372424712, 5140.614453915971, 5174.120399532088, 5174.327337446146, 5183.637145399824, 5225.581953443715, 5246.527812496855, 5251.212318152269, 4648.953510464919, 4872.220444728861, 4886.828960986349, 4898.21628539432, 4903.53416425439, 5217.321748172713, 5244.370675518962, 5253.185756207794, 5338.626296159309, 5370.275012873212, 5041.420236672756, 5105.770240339194, 5108.6168537359845, 5115.693058416507, 5141.742912854343, 5126.820561280338, 5208.921866172011, 5224.085784987688, 5226.268322434862, 5239.1355426354985, 4902.583280421133, 4991.650584459126, 5031.471695471996, 5050.090983622983, 5148.716820574829, 5059.519345662156, 5061.342025536656, 5061.645684802103, 5061.772220250024, 5098.515641014098, 4402.25161722508, 4404.0, 4405.955940440619, 4446.888827779267, 4461.263891457938, 3735.458358537997, 3746.5316835395574, 3761.097336639187, 3789.0716774390453, 3795.9051023724073, 4375.146846364992, 4414.359917811899, 4433.778311084433, 4453.888652783707, 4455.5989960903025, 5150.948490515047, 5169.353830771153, 5169.870753231199, 5171.81898633546, 5214.217867319932, 4304.4834619845815, 4411.029573493826, 4417.138657961731, 4418.955810441918, 4419.977900110479, 4554.385158003627, 4581.450225972904, 4588.197065513588, 4662.347271382009, 4675.275332323496, 4768.046390721869, 4776.71339719611, 4779.402574678165, 4785.521447855187, 4825.227963525819, 5058.317127187783, 5061.645684802029, 5070.0, 5070.188769796815, 5118.564921981673, 4661.557152070548, 4760.214564596941, 4806.062817750505, 4809.5430934061205, 4896.706197628154, 5053.949460505348, 5061.6962982221185, 5071.568916642127, 5074.2642316864585, 5118.667286626357, 5095.668781529189, 5123.87190320245, 5140.7429628517675, 5140.871478213075, 5148.613853960893, 4835.492273311252, 4936.407631084293, 4978.651494395358, 5005.549500544823, 5065.8733531662, 5036.043151801146, 5047.0, 5047.848564543069, 5048.949510504848, 5095.745212739423, 4960.50394960501, 4973.9253911190635, 5016.0, 5018.723970181675, 5024.070546948826, 4883.0, 4934.111859865258, 5001.024800163933, 5012.87467813293, 5069.645124841373, 4864.173090574682, 4877.464078271117, 4880.511948805233, 4884.145274577006, 4918.827841025547], "value": 4711.65123431879, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [568.3464016381164, 569.3310360326617, 571.3458090486396, 574.124460198198, 582.2954225387281, 29069.999999999975, 39373.60626393735, 40726.59273407265, 40839.183216335696, 44180.337294940604, 40012.19975600486, 40434.19131617366, 40440.191196176056, 40483.19033619326, 40565.79717101411, 7488.700451981914, 7633.198514156017, 7634.236576342377, 7635.809104772369, 7660.310572048515, 7390.778276651682, 9786.608535658565, 10028.498575071253, 10034.648787292446, 10349.223808214376, 10079.193664506822, 10168.389896606228, 10170.796584068314, 10171.949140254326, 10172.38965662059, 10018.749531261705, 10080.941501142348, 10083.44541050242, 10088.445135517544, 10095.34380265284, 9956.0, 10029.69910902674, 10034.89965100347, 10046.19630429564, 10047.24645651579, 38908.0, 39198.80400598007, 39201.41197882034, 39210.41184382208, 39345.0, 3088.1507585413965, 3162.9525557116663, 3396.762226644136, 3430.5540279763472, 3731.104534911629, 28035.29911752202, 28424.573631395546, 30333.24166895823, 30422.84788576065, 30995.380092398253, 3353.5472711184166, 3537.6639219274384, 3561.12752375667, 3574.2601411154396, 3642.0348607619003, 258615.0, 263055.0, 263975.6801216001, 264230.0, 265109.0, 32567.51148732771, 58719.0, 59564.0, 59585.40414595798, 59589.0, 33545.83227083849, 35391.0, 35411.4688279676, 35419.114522137155, 35422.46866297007, 12868.613941581767, 12994.675133121558, 13059.477620895248, 13060.673483162996, 13064.477420903248, 9427.811443771223, 11024.889751102386, 11057.0, 11149.442527873574, 11169.944150279196, 8004.79988000293, 8029.638666260033, 8116.173860881373, 8121.4721043132, 8136.552489613128, 3114.9844250779056, 3142.5600415941785, 3149.1497295730483, 3198.3283510462597, 3211.6306624737986, 856.39624065034, 858.9828203435897, 866.6576702202594, 950.2635457520477, 986.9457179855177, 28416.28959275993, 28702.282442939093, 28816.711832881403, 29304.12087637374, 29386.412271754445, 910.7358865928938, 921.8202450522084, 934.9158575728217, 959.2709540749081, 1002.0330381182049, 14750.082489276325, 15000.474983375529, 15183.924080379527, 15206.543803685907, 15290.0, 407232.0, 410216.0, 411524.0, 412143.0, 412174.0, 50730.49269507331, 51196.48803511992, 51362.48637513577, 51364.74317628388, 51377.74311128495, 1043.4574021508772, 1121.4448847820381, 1136.085451211766, 1165.1319766773809, 1167.2062997161672, 28058.2985425366, 28953.565696514146, 29493.115206543836, 29783.404331912807, 29925.850370748878, 42684.57315426806, 43202.78398607987, 43211.56788432201, 43243.35134973041, 43270.350944736485, 314901.0, 317437.0, 319162.0, 319556.0, 320062.0, 25438.745612543637, 26430.86784566065, 26545.7345426551, 27761.167164985083, 27797.16608501748, 42183.37303525341, 42475.5752442484, 42544.36183457312, 43036.0, 43962.0, 35754.64245357513, 36128.4580731284, 36287.27425451529, 36574.634253657125, 36953.44569831508, 36018.8199059003, 36076.63923360838, 36252.8187359072, 36404.27191456209, 36566.63433365632, 35703.82148089243, 35864.28271434505, 36018.63981360153, 36994.63005369912, 39510.0, 31639.841800790848, 33191.33617327688, 34048.14879628029, 34125.82937085299, 34229.0, 25116.24651260465, 25390.492190156463, 25446.618300725135, 25507.23478295654, 25814.78950652081], "value": 17160.312404686472, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [337.2378424760042, 364.6462930956971, 375.23077690734, 375.8853549667351, 385.18725489217746, 12299.446524906378, 16850.24173912174, 17342.739858902125, 18368.26526938921, 18533.907330463364, 16605.66788664229, 16638.584035399123, 17417.651646967086, 17604.0, 17665.116744162806, 5009.323741294924, 6633.402993730563, 6884.5525040872435, 6958.269381714923, 7094.11323584552, 6958.547694399873, 6968.442524598046, 6994.160700715921, 6997.405220556258, 7038.085048943656, 6805.965970170167, 6967.721291148373, 6968.094147760784, 6971.825704357407, 6972.546784459019, 6754.729810807562, 7055.894161587555, 7060.964695176492, 7085.787426377217, 7089.7873063808165, 6600.471962243009, 6771.8984215236815, 6807.353301436356, 6847.726090956356, 6854.383105520527, 22772.77227227723, 22993.88503057474, 23378.76621233783, 23382.298531044096, 23557.0, 1969.369801663454, 2086.968695469554, 2095.381862350595, 2517.7482251774677, 2602.2193341997513, 13468.191908485522, 14718.92640536801, 14776.48282310114, 15243.0, 15428.53714388559, 1881.74596429483, 1889.7732272127432, 1926.0, 1939.6217737541185, 1945.231633504772, 69829.65085174593, 79865.60067199684, 82700.17299826985, 82783.0, 84502.99999999939, 16693.83306166923, 16702.58243543921, 16881.15594220284, 17208.741868871977, 17298.65402691939, 28650.426991460055, 28687.56968645472, 28728.127187281105, 28811.56782648262, 28847.71152288492, 8778.34162437807, 8835.0, 8890.64437422496, 9130.771730706652, 9243.0, 6885.002417276753, 7151.106111736033, 7158.06945097134, 7444.501084490281, 7632.580208088498, 8260.504369737715, 8413.411061225655, 8578.227959483676, 8652.956735216283, 8707.779516223323, 2749.780017598587, 2808.304028133015, 2834.5039618067167, 2886.3794284228993, 2940.5442156465783, 735.7130719019586, 850.8596081646459, 856.7044369692446, 860.2515811244258, 914.0950459045497, 16160.030398176146, 16794.6641067178, 16852.662946740995, 17344.913275433795, 17832.55418614545, 806.4959400374765, 810.8054067023871, 852.1265702654705, 861.4831101339272, 883.9779005524913, 9073.59168837404, 9479.146876780986, 9723.076307750753, 9729.416235025921, 9905.60377584903, 378154.0, 382415.0, 383554.0, 384166.0, 393074.0, 76878.23121768823, 78405.60797195978, 78462.6076869612, 78965.0, 82789.58605207056, 848.410354803418, 867.7873920889297, 869.4913475616835, 872.3283072034498, 874.7506960516349, 15245.847541524887, 15414.152221627917, 15763.448279310169, 15838.60403489922, 16005.221802020184, 34932.301353973286, 36091.639083608825, 36501.26997460089, 36597.268054638225, 36839.81580092083, 51717.48282517127, 52461.21308180457, 52540.0, 53053.7347313261, 53471.465285348204, 7202.423806095395, 7653.081630204411, 7671.462997590115, 7733.535987840747, 7886.290233878978, 11356.0, 11504.769904602028, 12012.459439325427, 12261.816072759095, 12457.439415226156, 10378.27352085377, 10401.115905148146, 10521.210909181995, 10581.841272380767, 10770.407627580558, 10206.642767503101, 10409.271351005356, 10638.680839574825, 10696.411697356409, 10915.781684366428, 9729.881063677767, 10203.183745300506, 10589.0, 10726.93891728254, 10870.510827012962, 7593.278638529331, 7620.923790762243, 7652.507760986554, 7693.230676932262, 7974.162712915292, 7773.572453514885, 9265.768355791159, 10189.03525629818, 10544.736381590521, 10724.946375268073], "value": 9390.08526691425, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1218.5125949620156, 1294.7086905446276, 1372.9244891530966, 1394.3237529798052, 1642.72073747463, 6370.777022804203, 7226.349628533438, 7519.962400188005, 7535.811604709878, 7771.300582947533, 7581.583012934287, 7612.391008719303, 7646.235376462351, 7649.04386951631, 7650.967119438874, 2169.8047175754177, 2183.3995651195887, 2185.4208634711813, 2201.350601572532, 2203.526241858, 2137.5190582118976, 2184.4757258258064, 2210.4694873230387, 2212.225720997654, 2213.269621025058, 2157.5253444242244, 2169.9240526581575, 2179.553191595719, 2179.7602263751055, 2197.0662468450923, 2109.272301056133, 2110.3879874836434, 2115.756687980871, 2116.354511873878, 2118.1315660579166, 2090.1639344262267, 2144.0994782191515, 2144.9571008579896, 2147.61342958269, 2147.967780483294, 7324.6337683115635, 7454.40364770817, 7584.051993500812, 7618.6190690465255, 7629.847403051964, 4419.270820314677, 4531.478879928817, 4546.045330480603, 4552.544745525421, 4552.658550608718, 2828.0, 2937.206954122375, 2965.644122705268, 2970.3613723049434, 2980.582718419423, 870.8824308718368, 872.5986046418654, 879.8900137482815, 887.8268737596171, 898.1871406377239, 10121.392716437038, 10152.543135558917, 10178.287519873611, 10197.745056373577, 10255.487225638688, 3760.8495660173285, 3961.4057891316534, 4010.7794071326357, 4115.753054816721, 4118.094019315746, 7718.884216736754, 7720.922790772132, 7722.652480638385, 7731.188225236382, 7735.961320193475, 4412.823487060482, 4420.823167073346, 4430.800613972379, 4434.379186913835, 4434.800433980478, 3553.7690050147175, 4057.4522439470293, 4132.33882578792, 4134.37984302351, 4206.326987681956, 3277.852496637657, 3310.453775127125, 3416.0435078178148, 3443.6384179660777, 3447.931041379158, 971.8736564246602, 996.875390576178, 1002.4937406609615, 1007.5969612155196, 1019.1337363241333, 609.8658295175143, 615.7536985205863, 720.4020662849822, 751.5340488896919, 753.156464759462, 4800.423949126127, 4859.052484765508, 4996.4503904570465, 5007.774650140753, 5044.117279476077, 375.78204641307974, 382.80285652888784, 387.46336324191196, 390.3442217075341, 890.528020149322, 3237.14215732831, 3257.7068063874367, 3288.408086544445, 3355.9496607550905, 3496.3182179474757, 9116.772080698036, 9534.189593884597, 9534.237261019101, 9547.761305967268, 9562.139407453362, 9385.906140938503, 9418.152366287068, 9423.717288481357, 9435.29235307341, 9456.905430945602, 7075.080239568823, 7156.964215178891, 7176.605286709177, 7178.856422871513, 7214.531055481377, 5086.0, 5251.501107394792, 5314.97342513285, 5446.509814116748, 5504.944950550604, 8593.269572086443, 8623.223909848144, 8628.611712472828, 8650.43772154808, 8681.696140635047, 8525.914740852511, 8685.478871267744, 8731.126887311219, 8876.02363740001, 8911.197992180734, 5503.284573005483, 6323.6838158090995, 6475.158229430144, 6555.311692272243, 6571.408573228432, 7171.42628589722, 7552.433567482351, 7560.054993125859, 7562.508436951581, 7565.394768418623, 6507.023946408077, 6579.868402631825, 6621.735130594915, 6726.932730672631, 6860.176778786577, 6468.870622587616, 6507.934920650733, 6625.801225963229, 6645.800625981228, 6711.865762684622, 6196.225471816023, 6286.622802631674, 6295.150154729053, 6300.810975670737, 6311.147995020613, 4422.380866678732, 4428.070105277928, 4555.134524440346, 4578.954210457986, 4604.953950460453, 4274.294741367639, 4454.398656181504, 4460.620847228022, 4495.662825288182, 4520.118576877478], "value": 3917.113501973875, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [294.7465179945247, 296.8441568176707, 300.2433866656028, 304.4459084466272, 305.8088694565896, 4885.267209918509, 4915.272024026673, 4953.504649535049, 4953.854302517909, 4962.354893863797, 4827.0, 4840.298156767267, 4867.172580661288, 4873.22028475444, 4889.364382630262, 3643.253133107713, 3753.6058713835064, 3785.167263202091, 3830.9425358619505, 3864.9227015459815, 3824.7513911595797, 3854.537455505343, 3866.0721426857494, 3890.435886796413, 3909.3940439231965, 3793.108619474421, 3797.3354662934016, 3798.3922572388424, 3813.0, 3820.522434695663, 3617.421212605984, 3680.9263814723554, 3787.621237876218, 3790.9431358529646, 3833.5399752029657, 3345.698887100148, 3354.9702430029724, 3358.932821343584, 3370.3933292007428, 3406.880759173417, 4688.7186768793645, 4712.687890580115, 4714.669973101884, 4716.174669432869, 4755.881102972418, 4167.541360523823, 4331.220380331539, 4384.912301753979, 4387.912241755147, 4390.978045109786, 4965.280034394992, 5032.723200223986, 5046.419661738873, 5047.066292735819, 5049.141645920203, 3701.0932321581386, 3703.148275896532, 3703.925921481555, 3713.57293911201, 3713.628637136265, 5064.924026139574, 5257.5005374489365, 5272.420033796279, 5288.81489147878, 5305.124654432014, 3726.31063253299, 3754.723394045983, 3754.981225093857, 3760.0975765816556, 3770.5098337216536, 3813.580506144322, 3813.7902415366866, 3815.7138214634015, 3833.4824798651825, 3842.3852183650483, 4335.089631177425, 4342.413774140514, 4343.695941284143, 4356.934645980313, 4360.781960902005, 4809.470958194595, 5034.647574669738, 5071.137906555894, 5107.284980102789, 5126.871828204325, 1324.2385628263787, 1331.3210262766058, 1331.5406184866206, 1334.5129027904939, 1336.3117994232978, 820.9753707388788, 853.1255463150196, 868.887044684187, 877.0834477970536, 883.1433509495779, 4316.525182229952, 4405.383246345515, 4473.194824931478, 4508.436445444319, 4527.547245275512, 5245.1345527988215, 5250.18622113573, 5255.264263003182, 5264.447233040552, 5292.867678308073, 4500.627308670822, 4505.932411013838, 4516.728996260234, 4531.297648864365, 4555.589996900295, 2624.8950041998105, 2770.2104900103373, 2773.5839624056553, 2779.7915156363356, 2782.2348854065294, 4912.4350699669285, 4948.4061912570005, 4955.554000140005, 4955.900881982412, 4961.90076198474, 5073.923891141636, 5306.97346513265, 5338.199270109515, 5341.439148889388, 5369.624126311199, 4906.552566992746, 4934.950650493521, 4952.306677065214, 4954.9752251238515, 4972.190712247569, 5177.663451875616, 5216.6348355616265, 5238.371395432572, 5238.895222095613, 5284.8901730637, 4974.801007959641, 5135.38375394955, 5149.948500514947, 5156.587473002076, 5175.404828444777, 4883.755812209304, 4895.608351331956, 4906.533879281463, 4908.631852610997, 4933.210686290176, 3800.7909564974193, 3814.3706288462095, 3822.4266360046217, 3827.578966313759, 3833.6358045985585, 5016.673916195436, 5260.500252476008, 5269.1569348903995, 5273.947260527346, 5284.678830292427, 5054.721990290569, 5078.898422031465, 5092.516210959953, 5093.2105523643895, 5152.458991805806, 5070.315507406601, 5110.744462776921, 5118.129917914038, 5124.231365295235, 5178.197379406198, 4860.222364421676, 4991.477599332238, 5086.847394578169, 5087.0, 5094.51602097815, 4879.609631229564, 4987.177115775857, 5085.440601533903, 5101.0, 5113.897722045613, 4975.402951645681, 4980.477049909852, 4988.376452943382, 4997.350344455198, 5066.518680725325], "value": 3848.764925014577, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [588.7792077970761, 643.4562794438698, 648.9716371694547, 685.8593988232416, 686.9793906182816, 11802.940985295072, 13444.596662100153, 13547.119437236574, 13589.184648921058, 13611.319434028308, 13288.667783305422, 13450.663733406669, 13462.1922684639, 13484.123531970416, 13485.730285394286, 612.6722203621064, 751.4814777803311, 759.9506032107923, 762.5196126440335, 763.5914785589711, 745.4856149257023, 772.671614563811, 774.9535027898316, 777.6772639354662, 778.5367706214793, 796.5459687977855, 812.0134037144868, 812.3501199040774, 812.9187081291853, 813.3168138763438, 636.045931103345, 808.1352952340998, 809.9433039687253, 810.4488947515687, 811.6185392865344, 557.7490129441768, 575.0253320621548, 579.6637949988997, 582.9533637309005, 583.6848102024901, 12609.684757881127, 12617.179883307555, 12639.115261931669, 12647.367631618474, 12680.239185648798, 11370.545178192862, 11786.764264714659, 11917.165798394115, 11967.521299148024, 12478.937605311916, 10419.843702344471, 10561.947190264076, 10603.363798172135, 10656.62701805433, 10664.306820056672, 3772.5472943246714, 3810.618938106195, 3832.7508711933633, 3834.9808250958845, 3949.5063117110362, 62993.685031575005, 63189.68405157945, 63302.68348658273, 64189.35810641927, 64449.3555064448, 9239.491827949527, 9252.398594091363, 9265.953670231605, 9291.442513449214, 9407.106324899123, 17266.0, 17440.738388924176, 17612.20745066475, 17677.11614419274, 17756.46730598084, 6385.233771947396, 6503.2521260054755, 6598.73605055802, 6699.698513566901, 6743.291954344723, 3418.179636887129, 3419.794812311269, 3441.535392722001, 3493.12671832042, 3549.5563054618174, 2647.8543680097778, 2738.986305068462, 2784.359597292634, 2790.693023767384, 2977.330100727319, 542.9348478182643, 548.8298627425511, 548.8435795798258, 549.0282200505163, 555.0370107862855, 418.811534809337, 549.8130635583841, 559.6628204242379, 571.0691572736413, 586.4897539140975, 7434.888476672854, 7766.301032907066, 7991.320737737357, 8119.431639785158, 8187.672493100328, 448.9506154323022, 460.2153328574772, 496.2506615011359, 526.394646156915, 555.6832605414875, 3772.679322257639, 3866.7873266970587, 3898.8440462381186, 3986.631296554407, 3999.8200080996426, 104172.47913760383, 106021.46989265004, 108812.0, 109463.0, 113952.0, 52395.47604523906, 85901.0, 86817.56591217003, 87354.0, 88563.0, 77622.0, 78863.0, 79495.0, 80102.5994870022, 81233.0, 7340.449466289942, 7634.770956871303, 7654.73208437702, 7705.383569314554, 7921.762347129596, 46324.7683761579, 48225.75887120542, 49380.753096234286, 49601.7725612311, 50419.0, 37812.43281350727, 43124.0, 52427.0, 59685.0, 61099.69450152721, 9828.705138845846, 10163.44101074448, 10281.691549253534, 10477.109445696897, 10531.0, 11464.140189485655, 11665.125115616192, 11891.0, 11943.283402995501, 12638.43127059303, 10676.946615266874, 10875.347479151276, 10956.616518421817, 11067.557297708323, 11204.887951120385, 10708.089812366035, 10944.124470042536, 11342.319460832376, 11360.54557817711, 11446.771064578828, 10644.946775266075, 10682.09202217789, 10688.412137332522, 11040.392778396945, 11324.37715925632, 9237.168654821098, 9613.375130616487, 9639.084286992724, 9735.756606084904, 10034.548445320124, 9117.316201284797, 9822.165115964937, 9864.85202721974, 9913.206943444651, 9928.222510218266], "value": 6365.511674022974, "unit": "score"}], "name": "dromaeo_css", "value": 6462.841882029961, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 114.0, 114.0, 115.0, 113.0, 113.0, 113.0, 112.0, 114.0, 113.0], "value": 112.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 123.0, 127.0, 183.0, 124.0, 125.0, 162.0, 123.0, 182.0, 124.0], "value": 142.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 162.0, 160.0, 160.0, 161.0, 162.0, 161.0, 161.0, 162.0, 162.0], "value": 161.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 77.0, 76.0, 118.0, 75.0, 77.0, 75.0, 77.0, 100.0, 75.0], "value": 82.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 121.0, 88.0, 84.0, 86.0, 117.0, 84.0, 85.0, 120.0], "value": 95.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 117.0, 117.0, 118.0, 116.0, 116.0, 117.0, 117.0, 116.0], "value": 116.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 145.0, 147.0, 146.0, 147.0, 146.0, 147.0, 147.0, 147.0, 147.0], "value": 146.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 94.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0], "value": 94.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 61.0, 62.0, 61.0, 60.0, 63.0, 62.0, 61.0, 62.0, 62.0], "value": 61.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 65.0, 65.0, 65.0, 65.0, 65.0, 65.0, 69.0, 66.0], "value": 65.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 79.0, 79.0, 79.0, 80.0, 79.0, 79.0, 81.0, 79.0, 86.0], "value": 79.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [133.0, 134.0, 132.0, 141.0, 129.0, 128.0, 128.0, 131.0, 162.0, 140.0], "value": 135.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [171.0, 165.0, 175.0, 164.0, 170.0, 168.0, 169.0, 170.0, 172.0, 166.0], "value": 169.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 68.0, 67.0, 66.0, 67.0, 68.0, 66.0, 68.0, 67.0, 66.0], "value": 67.1, "unit": "score"}], "name": "kraken", "value": 1531.2, "alertThreshold": 2.0}]} 16:47:31 INFO - Return code: 0 16:47:31 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:47:31 INFO - # TBPL SUCCESS # 16:47:31 INFO - Running post-action listener: _resource_record_post_action 16:47:31 INFO - [mozharness: 2016-08-01 23:47:31.946257Z] Finished run-tests step (success) 16:47:31 INFO - Running post-run listener: _resource_record_post_run 16:47:32 INFO - Total resource usage - Wall time: 1200s; CPU: 13.0%; Read bytes: 4096; Write bytes: 529334272; Read time: 8; Write time: 439040 16:47:32 INFO - TinderboxPrint: CPU usage
13.0% 16:47:32 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 16:47:32 INFO - TinderboxPrint: I/O write bytes / time
529,334,272 / 439,040 16:47:32 INFO - TinderboxPrint: CPU idle
8,333.4 (87.0%) 16:47:32 INFO - TinderboxPrint: CPU user
1,199.0 (12.5%) 16:47:32 INFO - TinderboxPrint: Swap in / out
0 / 0 16:47:32 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 245796864; Read time: 0; Write time: 240132 16:47:32 INFO - run-tests - Wall time: 1184s; CPU: 13.0%; Read bytes: 0; Write bytes: 283537408; Read time: 0; Write time: 198908 16:47:32 INFO - Running post-run listener: _upload_blobber_files 16:47:32 INFO - Blob upload gear active. 16:47:32 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:47:32 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 16:47:32 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'] 16:47:32 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 16:47:32 INFO - (blobuploader) - INFO - Open directory for files ... 16:47:32 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 16:47:32 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:47:32 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:47:33 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 16:47:33 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:47:33 INFO - (blobuploader) - INFO - Done attempting. 16:47:33 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:47:33 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:47:33 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:47:38 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:47:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:47:38 INFO - (blobuploader) - INFO - Done attempting. 16:47:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 16:47:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:47:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:47:39 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 16:47:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:47:39 INFO - (blobuploader) - INFO - Done attempting. 16:47:39 INFO - (blobuploader) - INFO - Iteration through files over. 16:47:39 INFO - Return code: 0 16:47:39 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:47:39 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:47:39 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/2f91bb700fb733a17c47b42a65ce88d814b894b23de7a813dfa63167a734f3b3f912140f0f2aa8e68ad59bb1807dc419666eddb7b51b4646a39b3b2d945d3b63", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/504d457517278c6dd02d33e3a3a41869551090dca376b331842b6e51f6137c7199bdf113fb09696d08f489bdb6ffb73f170794b1846d8a48b1fdad4bb917f515", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/087b5cb4e53e00f7c5dca86ff271d36d5dbbc0a25ce919f9e57a3e05d45152275e463bcd19f2fdacbd67c4887a95cfd0994090e0fc00df8b887b3764c848394d"} 16:47:39 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:47:39 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:47:39 INFO - Contents: 16:47:39 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/2f91bb700fb733a17c47b42a65ce88d814b894b23de7a813dfa63167a734f3b3f912140f0f2aa8e68ad59bb1807dc419666eddb7b51b4646a39b3b2d945d3b63", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/504d457517278c6dd02d33e3a3a41869551090dca376b331842b6e51f6137c7199bdf113fb09696d08f489bdb6ffb73f170794b1846d8a48b1fdad4bb917f515", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/087b5cb4e53e00f7c5dca86ff271d36d5dbbc0a25ce919f9e57a3e05d45152275e463bcd19f2fdacbd67c4887a95cfd0994090e0fc00df8b887b3764c848394d"} 16:47:39 INFO - Running post-run listener: copy_logs_to_upload_dir 16:47:39 INFO - Copying logs to upload dir... 16:47:39 INFO - mkdir: /builds/slave/test/build/upload/logs 16:47:39 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1242.041747 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 42 secs) (at 2016-08-01 16:47:39.164919) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-01 16:47:39.168795) ========= 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=934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590 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/2f91bb700fb733a17c47b42a65ce88d814b894b23de7a813dfa63167a734f3b3f912140f0f2aa8e68ad59bb1807dc419666eddb7b51b4646a39b3b2d945d3b63", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/504d457517278c6dd02d33e3a3a41869551090dca376b331842b6e51f6137c7199bdf113fb09696d08f489bdb6ffb73f170794b1846d8a48b1fdad4bb917f515", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/087b5cb4e53e00f7c5dca86ff271d36d5dbbc0a25ce919f9e57a3e05d45152275e463bcd19f2fdacbd67c4887a95cfd0994090e0fc00df8b887b3764c848394d"} build_url:https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011109 build_url: 'https://queue.taskcluster.net/v1/task/MBYQhaKQQs-eFly-OGBWBA/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/2f91bb700fb733a17c47b42a65ce88d814b894b23de7a813dfa63167a734f3b3f912140f0f2aa8e68ad59bb1807dc419666eddb7b51b4646a39b3b2d945d3b63", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/504d457517278c6dd02d33e3a3a41869551090dca376b331842b6e51f6137c7199bdf113fb09696d08f489bdb6ffb73f170794b1846d8a48b1fdad4bb917f515", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/087b5cb4e53e00f7c5dca86ff271d36d5dbbc0a25ce919f9e57a3e05d45152275e463bcd19f2fdacbd67c4887a95cfd0994090e0fc00df8b887b3764c848394d"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-01 16:47:39.194182) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-01 16:47:39.194516) ========= 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=934fc3100db09dcb9af4d4b6000001ab-1470093702.744429-1613617590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004445 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-01 16:47:39.279141) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-01 16:47:39.279481) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-01 16:47:39.279778) ========= ========= Total master_lag: 0.17 =========