builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-047 starttime: 1466532727.96 results: success (0) buildid: 20160621083052 builduid: 52f218857c63453c9ab390f632936197 revision: ecd3562339dcd51a604e82efbcb347de8b823aee ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:07.964248) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:07.964810) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:07.965151) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:07.983886) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:07.984242) ========= 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=03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-21 11:12:08-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 70.6M=0s 2016-06-21 11:12:08 (70.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.149991 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:08.152016) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:08.152433) ========= 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=03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016696 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:08.205080) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-06-21 11:12:08.205565) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev ecd3562339dcd51a604e82efbcb347de8b823aee --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 ecd3562339dcd51a604e82efbcb347de8b823aee --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=03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-21 11:12:08,347 truncating revision to first 12 chars 2016-06-21 11:12:08,347 Setting DEBUG logging. 2016-06-21 11:12:08,347 attempt 1/10 2016-06-21 11:12:08,347 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/ecd3562339dc?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-21 11:12:08,670 unpacking tar archive at: fx-team-ecd3562339dc/testing/mozharness/ program finished with exit code 0 elapsedTime=0.637086 ========= master_lag: 1.73 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-06-21 11:12:10.576370) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:10.576745) ========= script_repo_revision: ecd3562339dcd51a604e82efbcb347de8b823aee ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:10.581251) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:10.581595) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-21 11:12:10.598491) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-06-21 11:12:10.598906) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:12:10 INFO - MultiFileLogger online at 20160621 11:12:10 in /builds/slave/test 11:12:10 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 11:12:10 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:12:10 INFO - {'append_to_log': False, 11:12:10 INFO - 'base_work_dir': '/builds/slave/test', 11:12:10 INFO - 'blob_upload_branch': 'Fx-Team', 11:12:10 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:12:10 INFO - 'branch': 'Fx-Team', 11:12:10 INFO - 'buildbot_json_path': 'buildprops.json', 11:12:10 INFO - 'config_files': ('talos/linux_config.py',), 11:12:10 INFO - 'default_actions': ('clobber', 11:12:10 INFO - 'read-buildbot-config', 11:12:10 INFO - 'download-and-extract', 11:12:10 INFO - 'populate-webroot', 11:12:10 INFO - 'create-virtualenv', 11:12:10 INFO - 'install', 11:12:10 INFO - 'run-tests'), 11:12:10 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:12:10 INFO - 'download_minidump_stackwalk': True, 11:12:10 INFO - 'download_symbols': 'ondemand', 11:12:10 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:12:10 INFO - 'tooltool.py': '/tools/tooltool.py', 11:12:10 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:12:10 INFO - '/tools/misc-python/virtualenv.py')}, 11:12:10 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:12:10 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:12:10 INFO - 'installer_path': 'installer.exe', 11:12:10 INFO - 'log_level': 'info', 11:12:10 INFO - 'log_name': 'talos', 11:12:10 INFO - 'log_to_console': True, 11:12:10 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:12:10 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:12:10 INFO - 'opt_config_files': (), 11:12:10 INFO - 'pip_index': False, 11:12:10 INFO - 'sps_profile': False, 11:12:10 INFO - 'sps_profile_interval': 0, 11:12:10 INFO - 'suite': 'dromaeojs', 11:12:10 INFO - 'system_bits': '32', 11:12:10 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:12:10 INFO - 'title': 'talos-linux64-ix-047', 11:12:10 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:12:10 INFO - 'use_talos_json': True, 11:12:10 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:12:10 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:12:10 INFO - 'work_dir': 'build'} 11:12:10 INFO - ##### 11:12:10 INFO - ##### Running clobber step. 11:12:10 INFO - ##### 11:12:10 INFO - Running pre-action listener: _resource_record_pre_action 11:12:10 INFO - Running main action method: clobber 11:12:10 INFO - rmtree: /builds/slave/test/build 11:12:10 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:12:11 INFO - Running post-action listener: _resource_record_post_action 11:12:11 INFO - ##### 11:12:11 INFO - ##### Finished clobber step (success) 11:12:11 INFO - ##### 11:12:11 INFO - ##### 11:12:11 INFO - ##### Running read-buildbot-config step. 11:12:11 INFO - ##### 11:12:11 INFO - Running pre-action listener: _resource_record_pre_action 11:12:11 INFO - Running main action method: read_buildbot_config 11:12:11 INFO - Using buildbot properties: 11:12:11 INFO - { 11:12:11 INFO - "project": "", 11:12:11 INFO - "product": "firefox", 11:12:11 INFO - "script_repo_revision": "production", 11:12:11 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 11:12:11 INFO - "repository": "", 11:12:11 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 11:12:11 INFO - "buildid": "20160621083052", 11:12:11 INFO - "pgo_build": "True", 11:12:11 INFO - "basedir": "/builds/slave/test", 11:12:11 INFO - "buildnumber": 1269, 11:12:11 INFO - "slavename": "talos-linux64-ix-047", 11:12:11 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 11:12:11 INFO - "platform": "ubuntu64_hw", 11:12:11 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 11:12:11 INFO - "branch": "fx-team", 11:12:11 INFO - "repo_path": "integration/fx-team", 11:12:11 INFO - "revision": "ecd3562339dcd51a604e82efbcb347de8b823aee", 11:12:11 INFO - "stage_platform": "linux64-pgo", 11:12:11 INFO - "builduid": "52f218857c63453c9ab390f632936197", 11:12:11 INFO - "slavebuilddir": "test" 11:12:11 INFO - } 11:12:11 INFO - Found installer url https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 11:12:11 INFO - Running post-action listener: _resource_record_post_action 11:12:11 INFO - ##### 11:12:11 INFO - ##### Finished read-buildbot-config step (success) 11:12:11 INFO - ##### 11:12:11 INFO - ##### 11:12:11 INFO - ##### Running download-and-extract step. 11:12:11 INFO - ##### 11:12:11 INFO - Running pre-action listener: _resource_record_pre_action 11:12:11 INFO - Running main action method: download_and_extract 11:12:11 INFO - mkdir: /builds/slave/test/build/tests 11:12:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:11 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:12:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:12:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:12:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:11 INFO - Downloaded 1361 bytes. 11:12:11 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:12:11 INFO - Using the following test package requirements: 11:12:11 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:12:11 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:12:11 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:12:11 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:12:11 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:12:11 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:12:11 INFO - u'jsshell-linux-x86_64.zip'], 11:12:11 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:12:11 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:12:11 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:12:11 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:12:11 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:12:11 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:12:11 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:12:11 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:12:11 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:12:11 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:12:11 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:12:11 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:12:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:11 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:12:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:12:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:12:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:13 INFO - Downloaded 24225158 bytes. 11:12:13 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'] 11:12:13 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 11:12:14 INFO - Return code: 0 11:12:14 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 11:12:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:14 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:12:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:12:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:12:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:16 INFO - Downloaded 24225158 bytes. 11:12:16 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:12:16 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:12:17 INFO - Return code: 0 11:12: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')]} 11:12:17 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:12:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:12:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:12:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:19 INFO - Downloaded 14405384 bytes. 11:12:19 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'] 11:12:19 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 11:12:20 INFO - Return code: 0 11:12: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')]} 11:12:20 INFO - https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:12:20 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:12:20 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:12:20 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/aMV7shOCS1eptfHjzLhAxA/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 11:12:21 INFO - Downloaded 60130839 bytes. 11:12:21 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:12:21 INFO - mkdir: /builds/slave/test/properties 11:12:21 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:12:21 INFO - Writing to file /builds/slave/test/properties/build_url 11:12:21 INFO - Contents: 11:12:21 INFO - build_url:https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:12:22 INFO - Running post-action listener: _resource_record_post_action 11:12:22 INFO - Running post-action listener: set_extra_try_arguments 11:12:22 INFO - ##### 11:12:22 INFO - ##### Finished download-and-extract step (success) 11:12:22 INFO - ##### 11:12:22 INFO - ##### 11:12:22 INFO - ##### Running populate-webroot step. 11:12:22 INFO - ##### 11:12:22 INFO - Running pre-action listener: _resource_record_pre_action 11:12:22 INFO - Running main action method: populate_webroot 11:12:22 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:12:22 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:12:22 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:12:22 INFO - '--tppagecycles', 11:12:22 INFO - '7'], 11:12:22 INFO - 'tests': ['tsvgm']}}, 11:12:22 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:12:22 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:12:22 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:12:22 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:12:22 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:12:22 INFO - 'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:12:22 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:12:22 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:12:22 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:12:22 INFO - 'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['damp', 'tps']}, 11:12:22 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:12:22 INFO - 'tests': ['damp', 'tps']}, 11:12:22 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['dromaeo_dom']}, 11:12:22 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:12:22 INFO - 'g4': {'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['basic_compositor_video']}, 11:12:22 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 11:12:22 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['a11yr', 11:12:22 INFO - 'ts_paint', 11:12:22 INFO - 'tpaint', 11:12:22 INFO - 'sessionrestore', 11:12:22 INFO - 'sessionrestore_no_auto_restore', 11:12:22 INFO - 'tabpaint']}, 11:12:22 INFO - 'other-e10s': {'tests': ['a11yr', 11:12:22 INFO - 'ts_paint', 11:12:22 INFO - 'tpaint', 11:12:22 INFO - 'sessionrestore', 11:12:22 INFO - 'sessionrestore_no_auto_restore', 11:12:22 INFO - 'tabpaint']}, 11:12:22 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:12:22 INFO - 'ts_paint', 11:12:22 INFO - 'tpaint', 11:12:22 INFO - 'sessionrestore', 11:12:22 INFO - 'sessionrestore_no_auto_restore', 11:12:22 INFO - 'tabpaint']}, 11:12:22 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:12:22 INFO - 'ts_paint', 11:12:22 INFO - 'tpaint', 11:12:22 INFO - 'sessionrestore', 11:12:22 INFO - 'sessionrestore_no_auto_restore', 11:12:22 INFO - 'tabpaint']}, 11:12:22 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['a11yr', 11:12:22 INFO - 'ts_paint', 11:12:22 INFO - 'tpaint', 11:12:22 INFO - 'sessionrestore', 11:12:22 INFO - 'sessionrestore_no_auto_restore', 11:12:22 INFO - 'tabpaint']}, 11:12:22 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['a11yr', 11:12:22 INFO - 'ts_paint', 11:12:22 INFO - 'tpaint', 11:12:22 INFO - 'sessionrestore', 11:12:22 INFO - 'sessionrestore_no_auto_restore', 11:12:22 INFO - 'tabpaint']}, 11:12:22 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['tsvgx', 11:12:22 INFO - 'tsvgr_opacity', 11:12:22 INFO - 'tart', 11:12:22 INFO - 'tscrollx', 11:12:22 INFO - 'cart']}, 11:12:22 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:12:22 INFO - 'tsvgr_opacity', 11:12:22 INFO - 'tart', 11:12:22 INFO - 'tscrollx', 11:12:22 INFO - 'cart']}, 11:12:22 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:12:22 INFO - 'talos_options': ['--disable-e10s'], 11:12:22 INFO - 'tests': ['tp5o']}, 11:12:22 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:12:22 INFO - 'tests': ['tp5o']}, 11:12:22 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:12:22 INFO - 'talos_options': ['--disable-e10s', 11:12:22 INFO - '--xperf_path', 11:12:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:12:22 INFO - 'tests': ['tp5n']}, 11:12:22 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:12:22 INFO - 'talos_options': ['--xperf_path', 11:12:22 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:12:22 INFO - 'tests': ['tp5n']}}, 11:12:22 INFO - 'talos.zip': {'path': '', 11:12:22 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:12:22 INFO - Running post-action listener: _resource_record_post_action 11:12:22 INFO - ##### 11:12:22 INFO - ##### Finished populate-webroot step (success) 11:12:22 INFO - ##### 11:12:22 INFO - ##### 11:12:22 INFO - ##### Running create-virtualenv step. 11:12:22 INFO - ##### 11:12:22 INFO - Running pre-action listener: _resource_record_pre_action 11:12:22 INFO - Running main action method: create_virtualenv 11:12:22 INFO - Creating virtualenv /builds/slave/test/build/venv 11:12:22 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 11:12:22 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:12:22 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:12:22 INFO - Using real prefix '/usr' 11:12:22 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:12:23 INFO - Installing distribute.............................................................................................................................................................................................done. 11:12:25 INFO - Installing pip.................done. 11:12:25 INFO - Return code: 0 11:12:25 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:12:25 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')]} 11:12:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:25 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')]} 11:12:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:25 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 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:25 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 11:12:25 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 11:12:25 INFO - Using env: {'DISPLAY': ':0', 11:12:25 INFO - 'HOME': '/home/cltbld', 11:12:25 INFO - 'LANG': 'en_US.UTF-8', 11:12:25 INFO - 'LANGUAGE': 'en_US:en', 11:12:25 INFO - 'LOGNAME': 'cltbld', 11:12:25 INFO - 'MAIL': '/var/mail/cltbld', 11:12:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:25 INFO - 'MOZ_NO_REMOTE': '1', 11:12:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:25 INFO - 'NO_EM_RESTART': '1', 11:12:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:25 INFO - 'PWD': '/builds/slave/test', 11:12:25 INFO - 'SHELL': '/bin/bash', 11:12:25 INFO - 'SHLVL': '1', 11:12:25 INFO - 'TERM': 'linux', 11:12:25 INFO - 'TMOUT': '86400', 11:12:25 INFO - 'USER': 'cltbld', 11:12:25 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:25 INFO - '_': '/tools/buildbot/bin/python'} 11:12:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:25 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 11:12:25 INFO - Cleaning up... 11:12:25 INFO - Return code: 0 11:12:25 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:12:25 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')]} 11:12:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:25 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')]} 11:12:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:25 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 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:25 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 11:12:25 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 11:12:25 INFO - Using env: {'DISPLAY': ':0', 11:12:25 INFO - 'HOME': '/home/cltbld', 11:12:25 INFO - 'LANG': 'en_US.UTF-8', 11:12:25 INFO - 'LANGUAGE': 'en_US:en', 11:12:25 INFO - 'LOGNAME': 'cltbld', 11:12:25 INFO - 'MAIL': '/var/mail/cltbld', 11:12:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:25 INFO - 'MOZ_NO_REMOTE': '1', 11:12:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:25 INFO - 'NO_EM_RESTART': '1', 11:12:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:25 INFO - 'PWD': '/builds/slave/test', 11:12:25 INFO - 'SHELL': '/bin/bash', 11:12:25 INFO - 'SHLVL': '1', 11:12:25 INFO - 'TERM': 'linux', 11:12:25 INFO - 'TMOUT': '86400', 11:12:25 INFO - 'USER': 'cltbld', 11:12:25 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:25 INFO - '_': '/tools/buildbot/bin/python'} 11:12:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:25 INFO - Downloading/unpacking psutil>=3.1.1 11:12:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:12:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:12:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:12:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:12:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:12:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:12:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:12:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:12:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:12:27 INFO - Installing collected packages: psutil 11:12:27 INFO - Running setup.py install for psutil 11:12:27 INFO - building 'psutil._psutil_linux' extension 11:12:27 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 11:12:28 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 11:12:28 INFO - building 'psutil._psutil_posix' extension 11:12:28 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 11:12:28 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 11:12:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:12:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:12:28 INFO - Successfully installed psutil 11:12:28 INFO - Cleaning up... 11:12:28 INFO - Return code: 0 11:12:28 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 11:12:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 11:12:28 INFO - Using env: {'DISPLAY': ':0', 11:12:28 INFO - 'HOME': '/home/cltbld', 11:12:28 INFO - 'LANG': 'en_US.UTF-8', 11:12:28 INFO - 'LANGUAGE': 'en_US:en', 11:12:28 INFO - 'LOGNAME': 'cltbld', 11:12:28 INFO - 'MAIL': '/var/mail/cltbld', 11:12:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:28 INFO - 'MOZ_NO_REMOTE': '1', 11:12:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:28 INFO - 'NO_EM_RESTART': '1', 11:12:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:28 INFO - 'PWD': '/builds/slave/test', 11:12:28 INFO - 'SHELL': '/bin/bash', 11:12:28 INFO - 'SHLVL': '1', 11:12:28 INFO - 'TERM': 'linux', 11:12:28 INFO - 'TMOUT': '86400', 11:12:28 INFO - 'USER': 'cltbld', 11:12:28 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:28 INFO - '_': '/tools/buildbot/bin/python'} 11:12:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:28 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:12: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 11:12: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 11:12: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 11:12: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 11:12: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 11:12: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 11:12:30 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:12:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:12:30 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:12:30 INFO - Installing collected packages: mozsystemmonitor 11:12:30 INFO - Running setup.py install for mozsystemmonitor 11:12:30 INFO - Successfully installed mozsystemmonitor 11:12:30 INFO - Cleaning up... 11:12:30 INFO - Return code: 0 11:12:30 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:12:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:30 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 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:30 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 11:12:30 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 11:12:30 INFO - Using env: {'DISPLAY': ':0', 11:12:30 INFO - 'HOME': '/home/cltbld', 11:12:30 INFO - 'LANG': 'en_US.UTF-8', 11:12:30 INFO - 'LANGUAGE': 'en_US:en', 11:12:30 INFO - 'LOGNAME': 'cltbld', 11:12:30 INFO - 'MAIL': '/var/mail/cltbld', 11:12:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:30 INFO - 'MOZ_NO_REMOTE': '1', 11:12:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:30 INFO - 'NO_EM_RESTART': '1', 11:12:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:30 INFO - 'PWD': '/builds/slave/test', 11:12:30 INFO - 'SHELL': '/bin/bash', 11:12:30 INFO - 'SHLVL': '1', 11:12:30 INFO - 'TERM': 'linux', 11:12:30 INFO - 'TMOUT': '86400', 11:12:30 INFO - 'USER': 'cltbld', 11:12:30 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:30 INFO - '_': '/tools/buildbot/bin/python'} 11:12:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:30 INFO - Downloading/unpacking jsonschema==2.5.1 11:12:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:12:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:12:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:12:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:12:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:12:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:12:32 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 11:12:32 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 11:12:32 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 11:12:32 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 11:12:32 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 11:12:32 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 11:12:32 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 11:12:32 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 11:12:32 INFO - Downloading functools32-3.2.3-2.tar.gz 11:12:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 11:12:33 INFO - warning: no files found matching '*.txt' 11:12:33 INFO - no previously-included directories found matching 'build' 11:12:33 INFO - no previously-included directories found matching 'dist' 11:12:33 INFO - no previously-included directories found matching '.git*' 11:12:33 INFO - Installing collected packages: jsonschema, functools32 11:12:33 INFO - Running setup.py install for functools32 11:12:33 INFO - warning: no files found matching '*.txt' 11:12:33 INFO - no previously-included directories found matching 'build' 11:12:33 INFO - no previously-included directories found matching 'dist' 11:12:33 INFO - no previously-included directories found matching '.git*' 11:12:33 INFO - Successfully installed jsonschema functools32 11:12:33 INFO - Cleaning up... 11:12:33 INFO - Return code: 0 11:12:33 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 11:12:33 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')]} 11:12:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:33 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')]} 11:12:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:33 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 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:33 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 11:12:33 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 11:12:33 INFO - Using env: {'DISPLAY': ':0', 11:12:33 INFO - 'HOME': '/home/cltbld', 11:12:33 INFO - 'LANG': 'en_US.UTF-8', 11:12:33 INFO - 'LANGUAGE': 'en_US:en', 11:12:33 INFO - 'LOGNAME': 'cltbld', 11:12:33 INFO - 'MAIL': '/var/mail/cltbld', 11:12:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:33 INFO - 'MOZ_NO_REMOTE': '1', 11:12:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:33 INFO - 'NO_EM_RESTART': '1', 11:12:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:33 INFO - 'PWD': '/builds/slave/test', 11:12:33 INFO - 'SHELL': '/bin/bash', 11:12:33 INFO - 'SHLVL': '1', 11:12:33 INFO - 'TERM': 'linux', 11:12:33 INFO - 'TMOUT': '86400', 11:12:33 INFO - 'USER': 'cltbld', 11:12:33 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:33 INFO - '_': '/tools/buildbot/bin/python'} 11:12:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:33 INFO - Downloading/unpacking blobuploader==1.2.4 11:12:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:12:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:12:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:12:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 11:12:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 11:12:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 11:12:35 INFO - Downloading blobuploader-1.2.4.tar.gz 11:12:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 11:12:35 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 11:12:35 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 11:12:35 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 11:12:35 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 11:12:35 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 11:12:35 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 11:12:35 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 11:12:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 11:12:35 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 11:12:35 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 11:12:35 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 11:12:35 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 11:12:35 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 11:12:35 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 11:12:35 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 11:12:36 INFO - Downloading docopt-0.6.1.tar.gz 11:12:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 11:12:36 INFO - Installing collected packages: blobuploader, requests, docopt 11:12:36 INFO - Running setup.py install for blobuploader 11:12:36 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 11:12:36 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 11:12:36 INFO - Running setup.py install for requests 11:12:36 INFO - Running setup.py install for docopt 11:12:36 INFO - Successfully installed blobuploader requests docopt 11:12:36 INFO - Cleaning up... 11:12:36 INFO - Return code: 0 11:12:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:12:36 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')]} 11:12:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:36 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')]} 11:12:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:36 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 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:36 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 11:12:36 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 11:12:36 INFO - Using env: {'DISPLAY': ':0', 11:12:36 INFO - 'HOME': '/home/cltbld', 11:12:36 INFO - 'LANG': 'en_US.UTF-8', 11:12:36 INFO - 'LANGUAGE': 'en_US:en', 11:12:36 INFO - 'LOGNAME': 'cltbld', 11:12:36 INFO - 'MAIL': '/var/mail/cltbld', 11:12:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:36 INFO - 'MOZ_NO_REMOTE': '1', 11:12:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:36 INFO - 'NO_EM_RESTART': '1', 11:12:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:36 INFO - 'PWD': '/builds/slave/test', 11:12:36 INFO - 'SHELL': '/bin/bash', 11:12:36 INFO - 'SHLVL': '1', 11:12:36 INFO - 'TERM': 'linux', 11:12:36 INFO - 'TMOUT': '86400', 11:12:36 INFO - 'USER': 'cltbld', 11:12:36 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:36 INFO - '_': '/tools/buildbot/bin/python'} 11:12:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:12:36 INFO - Running setup.py (path:/tmp/pip-zwdIBE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:12:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:12:36 INFO - Running setup.py (path:/tmp/pip-g0x5xl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:12:37 INFO - Running setup.py (path:/tmp/pip-WlssrE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:12:37 INFO - Running setup.py (path:/tmp/pip-5MO_LM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:12:37 INFO - Running setup.py (path:/tmp/pip-KPlvpy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:12:37 INFO - Running setup.py (path:/tmp/pip-pGVvnn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:12:37 INFO - Running setup.py (path:/tmp/pip-kqgrk5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:12:37 INFO - Running setup.py (path:/tmp/pip-z2oZg5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:12:37 INFO - Running setup.py (path:/tmp/pip-UaTMB9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:12:37 INFO - Running setup.py (path:/tmp/pip-g8PLJP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:12:37 INFO - Running setup.py (path:/tmp/pip-OapTur-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:12:37 INFO - Running setup.py (path:/tmp/pip-K8KJNN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:12:37 INFO - Running setup.py (path:/tmp/pip-u_9689-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:12:37 INFO - Running setup.py (path:/tmp/pip-R1nsd2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:12:37 INFO - Running setup.py (path:/tmp/pip-so9L07-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:12:37 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:12:37 INFO - Running setup.py (path:/tmp/pip-eXicjU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:12:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:12:38 INFO - Running setup.py (path:/tmp/pip-06Eqqs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:12:38 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 11:12:38 INFO - Running setup.py install for manifestparser 11:12:38 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 11:12:38 INFO - Running setup.py install for mozcrash 11:12:38 INFO - Running setup.py install for mozdebug 11:12:38 INFO - Running setup.py install for mozdevice 11:12:38 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 11:12:38 INFO - Installing dm script to /builds/slave/test/build/venv/bin 11:12:38 INFO - Running setup.py install for mozfile 11:12:38 INFO - Running setup.py install for mozhttpd 11:12:38 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 11:12:38 INFO - Running setup.py install for mozinfo 11:12:38 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 11:12:38 INFO - Running setup.py install for mozInstall 11:12:38 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 11:12:38 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 11:12:38 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 11:12:38 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 11:12:38 INFO - Running setup.py install for mozleak 11:12:38 INFO - Running setup.py install for mozlog 11:12:39 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 11:12:39 INFO - Running setup.py install for moznetwork 11:12:39 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 11:12:39 INFO - Running setup.py install for mozprocess 11:12:39 INFO - Running setup.py install for mozprofile 11:12:39 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 11:12:39 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 11:12:39 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 11:12:39 INFO - Running setup.py install for mozrunner 11:12:39 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 11:12:39 INFO - Running setup.py install for mozscreenshot 11:12:39 INFO - Running setup.py install for moztest 11:12:39 INFO - Running setup.py install for mozversion 11:12:39 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 11:12:39 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 11:12:39 INFO - Cleaning up... 11:12:39 INFO - Return code: 0 11:12:39 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:12:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:12:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:39 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 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:39 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 11:12:39 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 11:12:39 INFO - Using env: {'DISPLAY': ':0', 11:12:39 INFO - 'HOME': '/home/cltbld', 11:12:39 INFO - 'LANG': 'en_US.UTF-8', 11:12:39 INFO - 'LANGUAGE': 'en_US:en', 11:12:39 INFO - 'LOGNAME': 'cltbld', 11:12:39 INFO - 'MAIL': '/var/mail/cltbld', 11:12:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:39 INFO - 'MOZ_NO_REMOTE': '1', 11:12:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:39 INFO - 'NO_EM_RESTART': '1', 11:12:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:39 INFO - 'PWD': '/builds/slave/test', 11:12:39 INFO - 'SHELL': '/bin/bash', 11:12:39 INFO - 'SHLVL': '1', 11:12:39 INFO - 'TERM': 'linux', 11:12:39 INFO - 'TMOUT': '86400', 11:12:39 INFO - 'USER': 'cltbld', 11:12:39 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:39 INFO - '_': '/tools/buildbot/bin/python'} 11:12:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 11:12:40 INFO - Running setup.py (path:/tmp/pip-LyDh3V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 11:12:40 INFO - Running setup.py (path:/tmp/pip-LnnntA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 11:12:40 INFO - Running setup.py (path:/tmp/pip-K5iGfy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 11:12:40 INFO - Running setup.py (path:/tmp/pip-3WYYFd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 11:12:40 INFO - Running setup.py (path:/tmp/pip-o7pGgo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 11:12:40 INFO - Running setup.py (path:/tmp/pip-t5Lrd_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 11:12:40 INFO - Running setup.py (path:/tmp/pip-hUTSFx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 11:12:40 INFO - Running setup.py (path:/tmp/pip-S1wsOU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 11:12:40 INFO - Running setup.py (path:/tmp/pip-EwvTJW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 11:12:40 INFO - Running setup.py (path:/tmp/pip-1nHadP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 11:12:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 11:12:40 INFO - Running setup.py (path:/tmp/pip-ERC5l4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 11:12:40 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)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 11:12:40 INFO - Running setup.py (path:/tmp/pip-6OtBcK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 11:12:40 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 11:12:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 11:12:40 INFO - Running setup.py (path:/tmp/pip-aGfxAM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 11:12:41 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)) 11:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 11:12:41 INFO - Running setup.py (path:/tmp/pip-4p3HCX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 11:12:41 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 11:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 11:12:41 INFO - Running setup.py (path:/tmp/pip-jwnLGY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 11:12:41 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)) 11:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 11:12:41 INFO - Running setup.py (path:/tmp/pip-aTg4_g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 11:12:41 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)) 11:12:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 11:12:41 INFO - Running setup.py (path:/tmp/pip-pGYt4Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 11:12:41 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)) 11:12:41 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)) 11:12:41 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)) 11:12:41 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)) 11:12:41 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)) 11:12:41 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)) 11:12:41 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 11:12:41 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 11:12:41 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 11:12:41 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 11:12:41 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 11:12:41 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 11:12:41 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 11:12:43 INFO - Downloading blessings-1.6.tar.gz 11:12:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 11:12:43 INFO - Installing collected packages: blessings 11:12:43 INFO - Running setup.py install for blessings 11:12:43 INFO - Successfully installed blessings 11:12:43 INFO - Cleaning up... 11:12:43 INFO - Return code: 0 11:12:43 INFO - Done creating virtualenv /builds/slave/test/build/venv. 11:12:43 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:12:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:12:43 INFO - Reading from file tmpfile_stdout 11:12:43 INFO - Current package versions: 11:12:43 INFO - argparse == 1.2.1 11:12:43 INFO - blessings == 1.6 11:12:43 INFO - blobuploader == 1.2.4 11:12:43 INFO - docopt == 0.6.1 11:12:43 INFO - functools32 == 3.2.3-2 11:12:43 INFO - jsonschema == 2.5.1 11:12:43 INFO - manifestparser == 1.1 11:12:43 INFO - mozInstall == 1.12 11:12:43 INFO - mozcrash == 0.17 11:12:43 INFO - mozdebug == 0.1 11:12:43 INFO - mozdevice == 0.48 11:12:43 INFO - mozfile == 1.2 11:12:43 INFO - mozhttpd == 0.7 11:12:43 INFO - mozinfo == 0.9 11:12:43 INFO - mozleak == 0.1 11:12:43 INFO - mozlog == 3.2 11:12:43 INFO - moznetwork == 0.27 11:12:43 INFO - mozprocess == 0.22 11:12:43 INFO - mozprofile == 0.28 11:12:43 INFO - mozrunner == 6.11 11:12:43 INFO - mozscreenshot == 0.1 11:12:43 INFO - mozsystemmonitor == 0.3 11:12:43 INFO - moztest == 0.7 11:12:43 INFO - mozversion == 1.4 11:12:43 INFO - psutil == 3.1.1 11:12:43 INFO - requests == 1.2.3 11:12:43 INFO - wsgiref == 0.1.2 11:12:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 11:12:43 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')]} 11:12:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:43 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')]} 11:12:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:43 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 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:43 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 11:12:43 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 11:12:43 INFO - Using env: {'DISPLAY': ':0', 11:12:43 INFO - 'HOME': '/home/cltbld', 11:12:43 INFO - 'LANG': 'en_US.UTF-8', 11:12:43 INFO - 'LANGUAGE': 'en_US:en', 11:12:43 INFO - 'LOGNAME': 'cltbld', 11:12:43 INFO - 'MAIL': '/var/mail/cltbld', 11:12:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:43 INFO - 'MOZ_NO_REMOTE': '1', 11:12:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:43 INFO - 'NO_EM_RESTART': '1', 11:12:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:43 INFO - 'PWD': '/builds/slave/test', 11:12:43 INFO - 'SHELL': '/bin/bash', 11:12:43 INFO - 'SHLVL': '1', 11:12:43 INFO - 'TERM': 'linux', 11:12:43 INFO - 'TMOUT': '86400', 11:12:43 INFO - 'USER': 'cltbld', 11:12:43 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:43 INFO - '_': '/tools/buildbot/bin/python'} 11:12:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:43 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)) 11:12:43 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)) 11:12:43 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)) 11:12:43 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)) 11:12:43 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)) 11:12:43 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)) 11:12:43 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)) 11:12:43 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)) 11:12:43 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)) 11:12:43 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)) 11:12:43 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)) 11:12:43 INFO - Cleaning up... 11:12:43 INFO - Return code: 0 11:12:43 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 11:12:43 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')]} 11:12:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:43 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')]} 11:12:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:43 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 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:43 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 11:12:43 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 11:12:43 INFO - Using env: {'DISPLAY': ':0', 11:12:43 INFO - 'HOME': '/home/cltbld', 11:12:43 INFO - 'LANG': 'en_US.UTF-8', 11:12:43 INFO - 'LANGUAGE': 'en_US:en', 11:12:43 INFO - 'LOGNAME': 'cltbld', 11:12:43 INFO - 'MAIL': '/var/mail/cltbld', 11:12:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:43 INFO - 'MOZ_NO_REMOTE': '1', 11:12:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:43 INFO - 'NO_EM_RESTART': '1', 11:12:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:43 INFO - 'PWD': '/builds/slave/test', 11:12:43 INFO - 'SHELL': '/bin/bash', 11:12:43 INFO - 'SHLVL': '1', 11:12:43 INFO - 'TERM': 'linux', 11:12:43 INFO - 'TMOUT': '86400', 11:12:43 INFO - 'USER': 'cltbld', 11:12:43 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:43 INFO - '_': '/tools/buildbot/bin/python'} 11:12:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:44 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 11:12:44 INFO - Cleaning up... 11:12:44 INFO - Return code: 0 11:12:44 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 11:12:44 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')]} 11:12:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:12:44 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:44 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')]} 11:12:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:12:44 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:12:44 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa31c9c1f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26358a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2700350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, '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': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', '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 11:12:44 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 11:12:44 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 11:12:44 INFO - Using env: {'DISPLAY': ':0', 11:12:44 INFO - 'HOME': '/home/cltbld', 11:12:44 INFO - 'LANG': 'en_US.UTF-8', 11:12:44 INFO - 'LANGUAGE': 'en_US:en', 11:12:44 INFO - 'LOGNAME': 'cltbld', 11:12:44 INFO - 'MAIL': '/var/mail/cltbld', 11:12:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:12:44 INFO - 'MOZ_NO_REMOTE': '1', 11:12:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:12:44 INFO - 'NO_EM_RESTART': '1', 11:12:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:12:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:12:44 INFO - 'PWD': '/builds/slave/test', 11:12:44 INFO - 'SHELL': '/bin/bash', 11:12:44 INFO - 'SHLVL': '1', 11:12:44 INFO - 'TERM': 'linux', 11:12:44 INFO - 'TMOUT': '86400', 11:12:44 INFO - 'USER': 'cltbld', 11:12:44 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:12:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:12:44 INFO - '_': '/tools/buildbot/bin/python'} 11:12:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:12:44 INFO - Downloading/unpacking flake8 11:12:44 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 11:12:44 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 11:12:44 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 11:12:44 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 11:12:44 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 11:12:44 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 11:12:46 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 11:12:46 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 11:12:46 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 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 11:12:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 11:12:46 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:12:46 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:12:46 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:12:46 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:12:46 INFO - no previously-included directories found matching 'docs/_build' 11:12:46 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 11:12:47 INFO - Running setup.py install for pep8 11:12:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 11:12:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 11:12:47 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 11:12:47 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 11:12:47 INFO - no previously-included directories found matching 'docs/_build' 11:12:47 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 11:12:47 INFO - Successfully installed flake8 mccabe pyflakes pep8 11:12:47 INFO - Cleaning up... 11:12:47 INFO - Return code: 0 11:12:47 INFO - Running post-action listener: _resource_record_post_action 11:12:47 INFO - Running post-action listener: _start_resource_monitoring 11:12:47 INFO - Starting resource monitoring. 11:12:47 INFO - ##### 11:12:47 INFO - ##### Finished create-virtualenv step (success) 11:12:47 INFO - ##### 11:12:47 INFO - ##### 11:12:47 INFO - ##### Running install step. 11:12:47 INFO - ##### 11:12:47 INFO - Running pre-action listener: _resource_record_pre_action 11:12:47 INFO - Running main action method: install 11:12:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 11:12:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 11:12:47 INFO - Reading from file tmpfile_stdout 11:12:47 INFO - Detecting whether we're running mozinstall >=1.0... 11:12:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 11:12:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 11:12:47 INFO - Reading from file tmpfile_stdout 11:12:47 INFO - Output received: 11:12:47 INFO - Usage: mozinstall [options] installer 11:12:47 INFO - Options: 11:12:47 INFO - -h, --help show this help message and exit 11:12:47 INFO - -d DEST, --destination=DEST 11:12:47 INFO - Directory to install application into. [default: 11:12:47 INFO - "/builds/slave/test"] 11:12:47 INFO - --app=APP Application being installed. [default: firefox] 11:12:47 INFO - mkdir: /builds/slave/test/build/application 11:12:47 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'] 11:12:47 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 11:13:04 INFO - Reading from file tmpfile_stdout 11:13:04 INFO - Output received: 11:13:04 INFO - /builds/slave/test/build/application/firefox/firefox 11:13:04 INFO - Running post-action listener: _resource_record_post_action 11:13:04 INFO - ##### 11:13:04 INFO - ##### Finished install step (success) 11:13:04 INFO - ##### 11:13:04 INFO - ##### 11:13:04 INFO - ##### Running run-tests step. 11:13:04 INFO - ##### 11:13:04 INFO - Running pre-action listener: _resource_record_pre_action 11:13:04 INFO - Running main action method: run_tests 11:13:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 11:13:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 11:13:04 INFO - Python 2.7.3 11:13:04 INFO - Return code: 0 11:13:04 INFO - grabbing minidump binary from tooltool 11:13:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:13:04 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 0x278f1c0>, '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 0x27900c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2790550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 11:13:04 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 11:13:04 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 11:13:04 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 11:13:04 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 11:13:04 INFO - Return code: 0 11:13:04 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 11:13:04 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 11:13:04 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 11:13:04 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 11:13:04 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 11:13:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 11:13:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 11:13:05 INFO - Return code: 0 11:13:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-047', '--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 11:13:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-047 --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 11:13:05 INFO - Using env: {'DISPLAY': ':0', 11:13:05 INFO - 'HOME': '/home/cltbld', 11:13:05 INFO - 'LANG': 'en_US.UTF-8', 11:13:05 INFO - 'LANGUAGE': 'en_US:en', 11:13:05 INFO - 'LOGNAME': 'cltbld', 11:13:05 INFO - 'MAIL': '/var/mail/cltbld', 11:13:05 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 11:13:05 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 11:13:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:13:05 INFO - 'MOZ_NO_REMOTE': '1', 11:13:05 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 11:13:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:13:05 INFO - 'NO_EM_RESTART': '1', 11:13:05 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:13:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:13:05 INFO - 'PWD': '/builds/slave/test', 11:13:05 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 11:13:05 INFO - 'SHELL': '/bin/bash', 11:13:05 INFO - 'SHLVL': '1', 11:13:05 INFO - 'TERM': 'linux', 11:13:05 INFO - 'TMOUT': '86400', 11:13:05 INFO - 'USER': 'cltbld', 11:13:05 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248', 11:13:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:13:05 INFO - '_': '/tools/buildbot/bin/python'} 11:13:05 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-047', '--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 11:13:05 INFO - mozversion application_buildid: 20160621083052 11:13:05 INFO - mozversion application_changeset: ecd3562339dcd51a604e82efbcb347de8b823aee 11:13:05 INFO - mozversion application_display_name: Nightly 11:13:05 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 11:13:05 INFO - mozversion application_name: Firefox 11:13:05 INFO - mozversion application_remotingname: firefox 11:13:05 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 11:13:05 INFO - mozversion application_vendor: Mozilla 11:13:05 INFO - mozversion application_version: 50.0a1 11:13:05 INFO - mozversion platform_buildid: 20160621083052 11:13:05 INFO - mozversion platform_changeset: ecd3562339dcd51a604e82efbcb347de8b823aee 11:13:05 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 11:13:05 INFO - mozversion platform_version: 50.0a1 11:13:05 INFO - using testdate: 1466532785 11:13:05 INFO - actual date: 1466532785 11:13:05 INFO - starting webserver on 'localhost:47035' 11:13:05 INFO - SUITE-START | Running 2 tests 11:13:05 INFO - TEST-START | dromaeo_css 11:13:05 INFO - operating with platform_type : linux_ 11:13:05 INFO - Initialising browser for dromaeo_css test... 11:13:05 INFO - TEST-INFO | started process 6290 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmprKz98Q/profile http://localhost:47035/getInfo.html) 11:13:09 INFO - PROCESS | 6290 | __metrics Screen width/height:1600/1200 11:13:09 INFO - PROCESS | 6290 | colorDepth:24 11:13:09 INFO - PROCESS | 6290 | Browser inner width/height: 1024/697 11:13:09 INFO - PROCESS | 6290 | __metrics 11:13:10 INFO - PROCESS | 6290 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:13:11 INFO - TEST-INFO | 6290: exit 0 11:13:11 INFO - Browser initialized. 11:13:11 INFO - Running cycle 1/1 for dromaeo_css test... 11:13:11 INFO - TEST-INFO | started process 6370 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmprKz98Q/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:13:23 INFO - PROCESS | 6370 | RSS: Main: 173912064 11:13:23 INFO - PROCESS | 6370 | 11:14:14 INFO - PROCESS | 6370 | 1466532854655 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] 11:16:23 INFO - PROCESS | 6370 | Cycle 1(1): loaded http://localhost:47035/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47035/tests/dromaeo/cssquery-ext.html) 11:16:24 INFO - PROCESS | 6370 | RSS: Main: 265412608 11:16:24 INFO - PROCESS | 6370 | 11:19:27 INFO - PROCESS | 6370 | Cycle 1(1): loaded http://localhost:47035/tests/dromaeo/cssquery-ext.html (next: http://localhost:47035/tests/dromaeo/cssquery-jquery.html) 11:19:27 INFO - PROCESS | 6370 | RSS: Main: 253116416 11:19:27 INFO - PROCESS | 6370 | 11:22:29 INFO - PROCESS | 6370 | Cycle 1(1): loaded http://localhost:47035/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47035/tests/dromaeo/cssquery-mootools.html) 11:22:30 INFO - PROCESS | 6370 | RSS: Main: 265490432 11:22:30 INFO - PROCESS | 6370 | 11:25:32 INFO - PROCESS | 6370 | Cycle 1(1): loaded http://localhost:47035/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47035/tests/dromaeo/cssquery-prototype.html) 11:25:32 INFO - PROCESS | 6370 | RSS: Main: 259215360 11:25:32 INFO - PROCESS | 6370 | 11:28:35 INFO - PROCESS | 6370 | Cycle 1(1): loaded http://localhost:47035/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47035/tests/dromaeo/cssquery-yui.html) 11:28:36 INFO - PROCESS | 6370 | RSS: Main: 240812032 11:28:36 INFO - PROCESS | 6370 | 11:31:39 INFO - PROCESS | 6370 | Cycle 1(1): loaded http://localhost:47035/tests/dromaeo/cssquery-yui.html (next: http://localhost:47035/tests/dromaeo/cssquery-dojo.html) 11:31:39 INFO - PROCESS | 6370 | RSS: Main: 290877440 11:31:39 INFO - PROCESS | 6370 | 11:31:39 INFO - PROCESS | 6370 | __start_tp_report 11:31:39 INFO - PROCESS | 6370 | _x_x_mozilla_page_load 11:31:39 INFO - PROCESS | 6370 | _x_x_mozilla_page_load_details 11:31:39 INFO - PROCESS | 6370 | |i|pagename|runs| 11:31:39 INFO - PROCESS | 6370 | |0;dojo.html;3128.624565052194;3133.7022982816625;3149.8740050397987;3169.667184945582;3192.984035079824;5260.053190425722;5328.413874473805;5340.973295133524;5457.399686034533;5465.617406781522;5316.840494785162;5416.241726158341;5434.402215756264;5485.61600687952;5535;4825.541573550507;4886.047220791947;4889.33993910821;4903.705777653335;5136.306598609196;5032.245163225527;5072.188449848025;5075.873103172414;5092.8472145835685;5093.134167191586;4816.25348071046;4846.7818948147415;4872.683275587093;4928.876778080541;4952;4782.163121453732;4792.904141917177;4799.976000120012;4865.805367785284;4907.2639104134305;4834.927476087862;4848.951510484885;4851.466338702739;4864.391951006124;4882.316475693406;5245.973770131163;5318.22885681574;5361.169018802092;5364.195370694388;5413.106837371829;5785.103308987113;5791.594588378815;5803.0134877071;5813.883722325572;5848.67832269225;5587.720613969285;5850.385709500526;5864.354920958691;5877.970610146965;5880.941190588125;5305.336832895888;5359.196120581905;5361.544268737123;5425.159100339375;5433.049216387117;5872.442117998783;5875.735591898375;5879.676617786063;5883.117532370179;5889.5877288590245;5573.693446860461;5587.106063029895;5666;5672.12082127271;5676;5684.77260909559;5740.39725828782;5741.62679425836;5742.626729262668;5801.50687191585;5708.571857110734;5717.371089180187;5719.3422756382715;5722.484976352148;5723.799667011718;5588.273524441796;5691;5702.144678298206;5724.141378793214;5737.454941780524;4358.912821743611;4372.278574035248;4372.803223854934;4402.163588918095;4411.117776444724;3903.316919539126;3924.293627147141;3932.2135572885536;3950.2889479893897;3954.723169378116;5219.243209734567;5237.450067742909;5253.763580638804;5261.947380526146;5448.727563621803;5591.049521581341;5610.719464026783;5631.71841407928;5632.7746890123935;5633.887322253532;5324.973375133177;5331.653442526223;5331.893362132736;5335.599830012765;5392.352917649907;4839.637027222902;4844.636652251095;4849.636277279218;4887.7556122194455;4910.533499317559;5958.582899197015;5973.253343332083;5977.760889564455;5983.521318294526;6018.488428483628;5755.107958266475;5759.596828222152;5761.48146666802;5761.711914404179;5764.36591974874;5778.711064446677;5912.852178695395;5923.614965027259;5937.970310148422;5992.400759923973;5666.744996475086;5731.942680573307;5737.168110624019;5737.856553586027;5744.224529688438;5770.538356931519;5781.479666830005;5797.420257974169;5800.1589769484035;5808.970955145197;5448.782048718007;5480.479354461319;5494.80768173112;5501.944980550144;5542.168674698827;5471.890562188813;5508.862278443071;5526.585506086979;5527.613067085265;5528.834134975958;5316.734163291742;5438.510534051954;5442.700651464207;5452.700101494456;5503.889922201613;5591.133374326986;5679.346875109415;5681.943180568307;5774.855628609318;5776.56675749312;5587.580931430078;5587.972060139673;5588.86027849307;5594.328680558359;5598.944010560005 11:31:39 INFO - PROCESS | 6370 | |1;ext.html;598.7634884220732;609.9204408197494;619.8698273362594;647.0908373734901;647.229796542115;32188.517172242406;35721.2855742885;35736.82131589345;41571.16857662845;42961.785191074;45101.0979780405;45395.09209815802;45406.772966135126;45564.77217613907;45649.31526027104;8777.736667899957;8920.8661870072;8926.687565935194;8929.33030022751;8935.329850261223;8825.691100811473;8925.553722313858;8928.062553431893;8933.95533022334;8940.642374305053;8975.95512022439;9004.819903601923;9009.099090090971;9012.324075694316;9019;8961.103889611019;8996.685116020908;9008.819823603557;9010.86483702745;9019.909800901973;8880.111988801133;8951.32865035125;8963.507007114606;8968.955155224246;8971.775705607412;42768.3584746229;43096.3535546967;43138;43261;43303.13393732108;3523.5419395478425;3537.557805274341;3552.2007548301426;3894.1822217334393;4243.533211346749;32261.354772904644;32717.6728232717;32725.836370818233;32786.836065819756;32875.01374958755;4243.377186871831;4286.063557482652;4413.955860441419;4423.402840616508;4556.658250631216;346755;347571;349661;351592;352683;57577;57880.421195788345;58162;58176.70911645499;58314;62912.68543657252;63123.684381578714;63217.367826322065;63246.36753632497;63336.68331658404;15600.84399155994;15725.135117568414;15764.921175394049;15806.288717007763;15855.682886342209;12365.134440589072;12400.379981000913;12405.503779848705;12414.75170496585;12429;14483.78274325886;15377.308021139075;15521.534353969399;15656.921715391578;15672;5077.720725360066;5313.628046036741;5769.624974376736;5920.407959204132;6019.367966363557;957.7797106665506;962.821877952581;999.4652860719625;1026.7627508851815;1030.577463240068;32075.19812004672;32575.140943886992;32898;32968.505472417935;33139.83430082834;1021.2442792333768;1032.865727455441;1057.7408534908843;1077.3266708307308;1092.448313601626;16812.579685507717;17154.914225428794;17565.47303580869;17569.79468647012;17626.735598966025;514989;523442;527023;527536;527809;56595.71702141463;56855.715721421126;56900;57592;57743.71128144332;1214.763121191377;1267.524678245658;1311.7179806341683;1349.2107117336272;1356.179511395631;29482.852585736935;30790.384192316476;30897.53653695241;31281;31393;49946;50135.74932125316;50443.49556504535;50578.2413263794;50715.49284507256;408724;411647.9417602893;412135;412499;414852;36669.44995825118;38287.61712382841;41849.1630167401;45488.77255613701;46523;52357.47642523678;52736.47263527469;53394.1990870145;54190;54438.183427249416;39910.60089399069;41534;41670;42025;42416.1516769669;40362.1927561453;41010.79494602508;41011.58988410078;41877.79061104675;42080;40410.59589404186;40832.1833563333;41451.37822932598;42384.152316952874;42666.57333426626;34118.862638344945;35988.95750235801;36605.26789464249;36666.26667466689;36806.63193368032;28632;29306.413871722874;29324.853375732986;29334.41331173322;29418.852905735333 11:31:39 INFO - PROCESS | 6370 | |2;jquery.html;379.53127887059486;386.66746597925794;386.872332130397;399.4367941202905;406.11872237245177;17880.46358609242;19776;19923;19930.800691993074;19932.30236941709;18022.369217077405;18178.181981810816;19003.714944275845;19246.51883702908;19264.229430822787;5475.808346707876;5590.608657393984;5651.2653355063785;5692.459216374438;5714.314282286132;5489.204065410533;5545.611807173499;5592.972035139818;5602.299712535933;5625.40933202014;5493.450654934514;5554.305711786027;5562.471565201299;5568.749406276707;5585.1063829787245;5488.094464413367;5585.804496842611;5590.105583106683;5622.606417550732;5636.887262254752;4951.306817045616;4992.326035985132;5019.272205530214;5043.84868453947;5044.848654540369;16133.91933040339;16302.592435189215;20517.281895133747;21672.34982950514;21687.566248675095;2301.1945818963395;2309.90760369585;2331.1491305673476;2351.306364622423;2408.2895545814026;14323.78514322286;14350.210738409383;14355.928220358936;14584;14809.555713328617;1953.326102494637;1965.9901700491548;1970.2513045042936;2015.7681866585383;2022.3225219551468;53371.46628533704;57708;80875.19124808794;81118.59440702818;82542.58728706378;9740.46427446483;9786.363886347364;10380.117689996285;10632.362058276529;10641.201909856636;14511.1293322401;14591.854081459049;14597.41610335596;14599.708005839824;14623.78064329036;7571.772846814604;7848.215178482106;7921.524708517392;7964.402669799788;7983;7421.925780742232;7540.811479712941;7605.239476052461;7711.0746710395115;7775.883361749578;6449.161608990895;6493.155889734304;6513.218413790375;6516.0877477153235;6669.399754022162;1800.3698705453248;1816;1843.981560184381;1888.4376790652373;1968;918.3066784577601;949.4255975135083;976.6435251133286;989.5942663508071;1015.751140970467;18153.909230453763;18877.905610472135;19968.60062798765;20717.58564828725;20865.68701469479;930.5951910918636;963.6290028339;1021.1371391174446;1038.413296487482;1079.222959469181;9104.681336153202;10835.349879007284;11036.834447483294;11076.335419874833;11224.607138750267;535744;541232;541338;542228;559535;65295.673521633034;82114;83395;100306.49846750866;100835.49582252042;1006.0894890124449;1010.4947526236881;1040.5785656809155;1048.7116043088213;1048.7902419516126;17549.82450175533;17695.292188312324;18122.45632631023;18200.362987295382;18309.725354119964;30808.69191308148;31059.689403106582;38506.229875401776;38573.42139867848;44124;57265.141022885524;57780.71109644593;59800;59938.10092848523;60196;8466.74599762008;8711.47731136134;8786.516741579275;8904.287656987555;8947;12845.871541284467;13222.471101155847;13693.863061369259;14103.153810771386;14125.788113178105;11852.70368240801;11895.643130706092;11926.761464770829;12029.338386388483;12175.33035683046;11697.590584329508;11760.176787624785;11891;11989.520419183134;12058.276503409823;11624.825627615422;12035.458404371999;12136.939315303367;12518.186317889307;12563.18339307942;8627.22354988054;8628.827423451621;8649.783755406164;8832.558372081241;8896.955515222382;10560.683179504627;11864.644060678194;11903.702407439883;11983.460744266355;12709.93645031769 11:31:39 INFO - PROCESS | 6370 | |3;mootools.html;1283.7239993401417;1379.6137081617148;1386.348416244365;1495.9976815533591;1731.0911771320054;7970.880436793445;8250.75247742568;8260.876086858701;8432.704855330065;8442.451240669352;8222.91777082229;8424.620892059856;8441.746747597566;8442.746717598482;8445.61994710238;2059.794020597943;2246.4833088389682;2325.8953347099336;2326.069572171128;2354.9411264718347;2339.631315680329;2344.6365813298967;2346.988265058681;2348.248560460653;2350.27141586108;2253.7971582557566;2279.6124658807958;2318;2323.268170526287;2324.535092981402;2003.1686849957323;2168.3820111268215;2246.2811900191946;2251.74104977928;2262.230841513885;2271.7841805028497;2288.8283378746496;2292.7363353214428;2293.7706229377095;2295.3458264394567;8578.785530361729;8651.740447786577;8659.523726195057;8663.870041949376;8682.479051256882;4767.594754445841;4893.168161412568;4901.607871370317;4901.852944411673;4902.950970490285;3238.17426556229;3387.373072817106;3396.3546926083964;3556.057644724124;3569.7501174917766;1124.7907022554878;1154.9711257218637;1161.8954294113487;1175.3829239649167;1191.7318603314272;11782.587609433629;11824.408779560987;11877.049836013099;11882.227655202385;11921.821172682417;4452.710573812692;4456.5766252205985;4605.309203619484;4606.677532572688;4644.140833945731;10073.899261007296;10080.848787268196;10084.142847857867;10097.192224622013;10109.090181883666;5030.924536131961;5040.193569028937;5044.041632089891;5046.545810877039;5048.62135339851;4125.814338354781;4437.312216606431;4549.7042692224895;4579.290210017452;4629.606483448944;3799.601041890617;3810.8666196682984;3915.393114067324;3975.6819454443576;3976.741511801724;1201.819727040951;1230.6308107567693;1240.975180496385;1258.7922992706285;1265.4432049898016;850.927671147947;853.9957300213459;913.7487191022389;948.2366694810744;966.3380584299778;5718.857028574235;5739.799107031234;5744.913826292609;5837.007708689533;5954.285485741739;433.0775448295111;1021.4177918586483;1027.5838285494387;1032.6488993742164;1085.571199376242;4252.277112890816;4278.101598664315;4302.978485107555;4303.913921721548;4349.217140914602;10596.09933155675;10771.730706732395;10804.405757683402;10901.945490272497;10911.127109831354;9984.101430871111;10444.112250458644;10756.300840445347;10757.462126893624;10758.139348852073;7677.500962437423;7772.8056798579355;7827.843443131105;7843.254890785481;7865.213478652089;5813.215215945793;5860;6202.937970620236;6205.193324867739;6301.306856245901;9582.856257156009;9665.226781857295;9979.151772099453;10034.799304014025;10042.096211341015;9995.750106247402;10098.798024039332;10241.334313269614;10339.224558158017;10348.948255258676;7315.231900650568;7957.80105497344;7969;8202.548859812767;8231.917680823115;8343.54110523927;8439.198276163756;8441.198086181803;8520.957395212985;8522.957385213034;7249.202587715453;7368.410527157707;7533.623318834146;7578.280063393969;7596.696132154873;7384.446166537424;7446.180920098893;7565;7606.353459955966;7634.083909930844;6788.558743681645;6827.010083537959;6883.483738719716;6894.586324820527;6901.654917254217;5131.87170320745;5264.499872512105;5411.215373770702;5425.104857698593;5443.047466693392;5202.2577144357165;5245.659032162897;5255.13290307095;5289.709066001406;5301.204819277139 11:31:39 INFO - PROCESS | 6370 | |4;prototype.html;287.7582830422446;295.8180718857902;310.6939664430537;319.787341417957;323.33877221082884;5197.532222100011;5245.370555533332;5363.195520671897;5412.756425960832;5432.348118225818;5158.529819001586;5242.3184985951775;5273.947260527393;5299.788008479656;5304.389995150559;4110.609492098246;4112.1775644870995;4113.814878330468;4133.883851360146;4138.772367519785;3912.902177445558;3914.4128380742973;4098.323776576861;4104.199681062194;4157.896052598694;4109.9178016439655;4114.341705327149;4115.341545352744;4116.238495878272;4143.399207114981;4098.159877225176;4117.6705863531;4123.134141830219;4143.316352801784;4161.500619925598;3376.3584918865336;3669.4679271505747;3670.119171398872;3672.485851980725;3690.760100593453;5125.436202017812;5165.018646457161;5185.948140518584;5191.117510023305;5200.791968321262;4714.882127946795;4718;4721.858344249678;4729.574338309534;4741.075490279397;5356.4107948125675;5450.574494350016;5457.86172950555;5466.234727138204;5500.28496295483;3916.2559113768293;3925.8429662813455;3932.2135572885536;3932.2725295820364;3942.349512330462;5717.171010203498;5718.571107166979;5760.971195143998;5780.913286300709;5809.622374545641;3879.903002424962;3978.1844721831953;4009.3785463253244;4017.7589344639414;4022.1699126897192;3971.781552014609;3979.3036218662196;4002.599090318365;4007.2987227235117;4008.358662614026;4573.908521829545;4576.908461830745;4601.677882548256;4616.376789133491;4632.536746325341;5513.401113677069;5539.169124631338;5553.194786755897;5576.247206627135;5591.440855914376;1262.6527704881048;1328.754180476615;1367.8715060075278;1373.5810577773875;1375.40170026039;847.3009766942297;858.3733874271817;864.2006144316482;867.7396780965685;878.7170730733073;4745.572898439157;4777.399571143636;4794.058406345435;4843.418789745183;4846.486297434332;4959.70241785494;4969.776360063805;4990.850274491771;5003.424606170264;5037.5214354636255;4454.888627784267;4663.090697314059;4699.086566328898;4725.5510726480925;4745.549172828576;2646.0474229277443;2654.765534026687;2680.571108622611;2687.475942191254;2695.339641787735;5087.821926232638;5095.210242412432;5119.539241468286;5142.820001300011;5153.742312884416;4867.196912509467;5090.440051594322;5109.3613298337705;5126.974365128151;5140.280360749498;4988.6757360771435;5123.666961647481;5125.7698152443145;5145.4854514549;5157.458466860926;4979.925301120558;5004.549590536869;5023.899522009612;5067.695938243717;5091.905240373338;4762.761861906822;4861.586765125004;4941.851744447672;4949.678270912379;4967.379077615298;5100.515451032146;5128.640995130305;5130.97434512825;5136.922946155736;5158.3235448480145;3533.3463309287863;3556.395412779885;3558.3594952908725;3558.87543935961;3579.8568057278458;4718.622510199107;4979.850604481871;4981.551660350586;4990.750462476934;5035.615205818282;4855.611551075976;4881.754392979269;4897.877553061202;4898.92651610219;4902.950970490249;4829.492903245108;4851.442084160367;4862.41651001882;4874.878128046827;4907.312976183266;4613.284940834176;4744.217204161275;4765.880852978703;4805;4830.913044564944;4908.509149085063;4912.845481311818;4947.084789313988;4951.548983253168;4952.257161425815;4713.31656909753;4809.422869255712;4815.903681926412;4869.586085182657;4883.853484395332 11:31:39 INFO - PROCESS | 6370 | |5;yui.html;763.5189830406842;769.6366876748609;775.8719811231147;791.5171745235409;795.9721409750659;14542.636434089152;14595.927020364896;14741.852581474182;14782.704345913075;14837.554873353789;14648.26758662068;15365.385384584632;15403.460878869242;15451.613709657237;15451.768223476629;652.8661624367018;742.220668298286;749.6326799868052;782.5695867273006;813.8453693798159;799.532273619933;811.4806523824757;812.2324403438753;813.0365516862537;813.1380736419414;854.2994744309668;859.8237361340911;860.8579584368572;861.3195575495351;861.3195575495382;679.500567083196;808.7897146741831;840.6385254340631;848.0925409811504;853.21504216121;615.5937081526216;616.035903810535;617.1575799034285;617.1575799034331;617.2870334763355;14377.065490743069;14582;14589.6352591185;14621.488247911378;14623.70752584953;13649.658758531017;13711.794323085162;13807.654808629764;14045.719085618333;14065.789013164811;12840.550580729723;12943.158694684815;13085.738285234242;13349.33253337339;13857.584272471842;4204.306289462235;4256.696206312842;4317.69776115672;4350.369196466526;4451.710638808467;70550.2944970554;70645;71241.6437917807;71364.2863571368;71453.64273178653;10637.787244255072;11333.093352531778;11456.59901903446;11531.827022594667;11915.106367022508;21560.78439215619;21758.673619895715;21761.129554817948;21762.673559896615;21791.346259612237;8204.179582041748;8280.58597070144;8335.458195217292;8337.583120843934;8488.787780305418;4414.227510185769;4432.304488731964;4480.283154695233;4497.707649002804;4692.296155576691;3372.898813035613;3472.722182225416;3473.531073305122;3481.8781342652887;3483.1988642611836;596.3767862583611;607.1318015238252;612.185792895448;618.8947878860605;626.7837596029362;558.5168828962999;565.7821738630574;580.8344621782771;596.7702434562638;628.4406877878691;9062.546872656472;9078.606235159315;9235.261179105655;9322.440653560672;9487.857682134774;596.3767862583611;624.1605041219552;645.2708439463377;654.4469922915129;655.2791928878196;4413.205622987829;4570.474395444567;4596.6322694185055;4641.280601506772;4708.683681821551;108920;109333.45333273443;111585;111907;112235.43882280536;95934;97219;97295;97302.51348743211;97767;80518.19481805107;84247;84281.57859210788;84455;84761.57619211865;8707.390482666406;8836.381453298465;8857.468551886908;8902.332325075775;9265.814683706154;45956.54043459523;48064;48433.515664842904;51786.22320665118;52264.21603676024;48155.27767083567;66870.3312966864;73435.63282183555;77915.61042194752;77974;10676.010716999253;10932.617358392417;13178.275194864374;13653.931730341284;13858.584242472742;14910.701785964004;15315.540533784004;15371.231438428258;15401.76897346563;16082;13500;13685.452581896612;13924.51264205748;14332.928335358256;14896.180710061051;12891.290978996245;13055.281959492318;13391.464341426623;13526.25605591702;13997.44010239579;13704.931475342559;14285.926637961213;14414.711705766036;15036.699266014399;15066;11448.198626096093;11871.940640296743;12091.75816483683;12129;12189.390530473618;11237.71905702364;11309;11681.19166512872;11854.703632409259;11966.880331196924 11:31:39 INFO - PROCESS | 6370 | __end_tp_report 11:31:39 INFO - PROCESS | 6370 | __start_cc_report 11:31:39 INFO - PROCESS | 6370 | _x_x_mozilla_cycle_collect,853 11:31:39 INFO - PROCESS | 6370 | __end_cc_report 11:31:39 INFO - PROCESS | 6370 | __startTimestamp1466533899271__endTimestamp 11:31:39 INFO - PROCESS | 6370 | 11:31:39 INFO - PROCESS | 6370 | ------- Summary: start ------- 11:31:39 INFO - PROCESS | 6370 | Number of tests: 6 11:31:39 INFO - PROCESS | 6370 | 11:31:39 INFO - PROCESS | 6370 | [#0] dojo.html Cycles:165 Average:5329.19 Median:5501.94 stddev:599.13 (10.9%) stddev-sans-first:575.56 11:31:39 INFO - PROCESS | 6370 | Values: 3128.6 3133.7 3149.9 3169.7 3193.0 5260.1 5328.4 5341.0 5457.4 5465.6 5316.8 5416.2 5434.4 5485.6 5535.0 4825.5 4886.0 4889.3 4903.7 5136.3 5032.2 5072.2 5075.9 5092.8 5093.1 4816.3 4846.8 4872.7 4928.9 4952.0 4782.2 4792.9 4800.0 4865.8 4907.3 4834.9 4849.0 4851.5 4864.4 4882.3 5246.0 5318.2 5361.2 5364.2 5413.1 5785.1 5791.6 5803.0 5813.9 5848.7 5587.7 5850.4 5864.4 5878.0 5880.9 5305.3 5359.2 5361.5 5425.2 5433.0 5872.4 5875.7 5879.7 5883.1 5889.6 5573.7 5587.1 5666.0 5672.1 5676.0 5684.8 5740.4 5741.6 5742.6 5801.5 5708.6 5717.4 5719.3 5722.5 5723.8 5588.3 5691.0 5702.1 5724.1 5737.5 4358.9 4372.3 4372.8 4402.2 4411.1 3903.3 3924.3 3932.2 3950.3 3954.7 5219.2 5237.5 5253.8 5261.9 5448.7 5591.0 5610.7 5631.7 5632.8 5633.9 5325.0 5331.7 5331.9 5335.6 5392.4 4839.6 4844.6 4849.6 4887.8 4910.5 5958.6 5973.3 5977.8 5983.5 6018.5 5755.1 5759.6 5761.5 5761.7 5764.4 5778.7 5912.9 5923.6 5938.0 5992.4 5666.7 5731.9 5737.2 5737.9 5744.2 5770.5 5781.5 5797.4 5800.2 5809.0 5448.8 5480.5 5494.8 5501.9 5542.2 5471.9 5508.9 5526.6 5527.6 5528.8 5316.7 5438.5 5442.7 5452.7 5503.9 5591.1 5679.3 5681.9 5774.9 5776.6 5587.6 5588.0 5588.9 5594.3 5598.9 11:31:39 INFO - PROCESS | 6370 | 11:31:39 INFO - PROCESS | 6370 | [#1] ext.html Cycles:180 Average:59580.82 Median:42400.15 stddev:115052.39 (271.3%) stddev-sans-first:115289.92 11:31:39 INFO - PROCESS | 6370 | Values: 598.8 609.9 619.9 647.1 647.2 32188.5 35721.3 35736.8 41571.2 42961.8 45101.1 45395.1 45406.8 45564.8 45649.3 8777.7 8920.9 8926.7 8929.3 8935.3 8825.7 8925.6 8928.1 8934.0 8940.6 8976.0 9004.8 9009.1 9012.3 9019.0 8961.1 8996.7 9008.8 9010.9 9019.9 8880.1 8951.3 8963.5 8969.0 8971.8 42768.4 43096.4 43138.0 43261.0 43303.1 3523.5 3537.6 3552.2 3894.2 4243.5 32261.4 32717.7 32725.8 32786.8 32875.0 4243.4 4286.1 4414.0 4423.4 4556.7 346755.0 347571.0 349661.0 351592.0 352683.0 57577.0 57880.4 58162.0 58176.7 58314.0 62912.7 63123.7 63217.4 63246.4 63336.7 15600.8 15725.1 15764.9 15806.3 15855.7 12365.1 12400.4 12405.5 12414.8 12429.0 14483.8 15377.3 15521.5 15656.9 15672.0 5077.7 5313.6 5769.6 5920.4 6019.4 957.8 962.8 999.5 1026.8 1030.6 32075.2 32575.1 32898.0 32968.5 33139.8 1021.2 1032.9 1057.7 1077.3 1092.4 16812.6 17154.9 17565.5 17569.8 17626.7 514989.0 523442.0 527023.0 527536.0 527809.0 56595.7 56855.7 56900.0 57592.0 57743.7 1214.8 1267.5 1311.7 1349.2 1356.2 29482.9 30790.4 30897.5 31281.0 31393.0 49946.0 50135.7 50443.5 50578.2 50715.5 408724.0 411647.9 412135.0 412499.0 414852.0 36669.4 38287.6 41849.2 45488.8 46523.0 52357.5 52736.5 53394.2 54190.0 54438.2 39910.6 41534.0 41670.0 42025.0 42416.2 40362.2 41010.8 41011.6 41877.8 42080.0 40410.6 40832.2 41451.4 42384.2 42666.6 34118.9 35989.0 36605.3 36666.3 36806.6 28632.0 29306.4 29324.9 29334.4 29418.9 11:31:39 INFO - PROCESS | 6370 | 11:31:39 INFO - PROCESS | 6370 | [#2] jquery.html Cycles:180 Average:30003.87 Median:2341.23 stddev:89227.31 (3811.1%) stddev-sans-first:89449.89 11:31:39 INFO - PROCESS | 6370 | Values: 379.5 386.7 386.9 399.4 406.1 17880.5 19776.0 19923.0 19930.8 19932.3 18022.4 18178.2 19003.7 19246.5 19264.2 5475.8 5590.6 5651.3 5692.5 5714.3 5489.2 5545.6 5593.0 5602.3 5625.4 5493.5 5554.3 5562.5 5568.7 5585.1 5488.1 5585.8 5590.1 5622.6 5636.9 4951.3 4992.3 5019.3 5043.8 5044.8 16133.9 16302.6 20517.3 21672.3 21687.6 2301.2 2309.9 2331.1 2351.3 2408.3 14323.8 14350.2 14355.9 14584.0 14809.6 1953.3 1966.0 1970.3 2015.8 2022.3 53371.5 57708.0 80875.2 81118.6 82542.6 9740.5 9786.4 10380.1 10632.4 10641.2 14511.1 14591.9 14597.4 14599.7 14623.8 7571.8 7848.2 7921.5 7964.4 7983.0 7421.9 7540.8 7605.2 7711.1 7775.9 6449.2 6493.2 6513.2 6516.1 6669.4 1800.4 1816.0 1844.0 1888.4 1968.0 918.3 949.4 976.6 989.6 1015.8 18153.9 18877.9 19968.6 20717.6 20865.7 930.6 963.6 1021.1 1038.4 1079.2 9104.7 10835.3 11036.8 11076.3 11224.6 535744.0 541232.0 541338.0 542228.0 559535.0 65295.7 82114.0 83395.0 100306.5 100835.5 1006.1 1010.5 1040.6 1048.7 1048.8 17549.8 17695.3 18122.5 18200.4 18309.7 30808.7 31059.7 38506.2 38573.4 44124.0 57265.1 57780.7 59800.0 59938.1 60196.0 8466.7 8711.5 8786.5 8904.3 8947.0 12845.9 13222.5 13693.9 14103.2 14125.8 11852.7 11895.6 11926.8 12029.3 12175.3 11697.6 11760.2 11891.0 11989.5 12058.3 11624.8 12035.5 12136.9 12518.2 12563.2 8627.2 8628.8 8649.8 8832.6 8897.0 10560.7 11864.6 11903.7 11983.5 12709.9 11:31:39 INFO - PROCESS | 6370 | 11:31:39 INFO - PROCESS | 6370 | [#3] mootools.html Cycles:180 Average:5688.69 Median:4592.30 stddev:3214.29 (70.0%) stddev-sans-first:3206.25 11:31:39 INFO - PROCESS | 6370 | Values: 1283.7 1379.6 1386.3 1496.0 1731.1 7970.9 8250.8 8260.9 8432.7 8442.5 8222.9 8424.6 8441.7 8442.7 8445.6 2059.8 2246.5 2325.9 2326.1 2354.9 2339.6 2344.6 2347.0 2348.2 2350.3 2253.8 2279.6 2318.0 2323.3 2324.5 2003.2 2168.4 2246.3 2251.7 2262.2 2271.8 2288.8 2292.7 2293.8 2295.3 8578.8 8651.7 8659.5 8663.9 8682.5 4767.6 4893.2 4901.6 4901.9 4903.0 3238.2 3387.4 3396.4 3556.1 3569.8 1124.8 1155.0 1161.9 1175.4 1191.7 11782.6 11824.4 11877.0 11882.2 11921.8 4452.7 4456.6 4605.3 4606.7 4644.1 10073.9 10080.8 10084.1 10097.2 10109.1 5030.9 5040.2 5044.0 5046.5 5048.6 4125.8 4437.3 4549.7 4579.3 4629.6 3799.6 3810.9 3915.4 3975.7 3976.7 1201.8 1230.6 1241.0 1258.8 1265.4 850.9 854.0 913.7 948.2 966.3 5718.9 5739.8 5744.9 5837.0 5954.3 433.1 1021.4 1027.6 1032.6 1085.6 4252.3 4278.1 4303.0 4303.9 4349.2 10596.1 10771.7 10804.4 10901.9 10911.1 9984.1 10444.1 10756.3 10757.5 10758.1 7677.5 7772.8 7827.8 7843.3 7865.2 5813.2 5860.0 6202.9 6205.2 6301.3 9582.9 9665.2 9979.2 10034.8 10042.1 9995.8 10098.8 10241.3 10339.2 10348.9 7315.2 7957.8 7969.0 8202.5 8231.9 8343.5 8439.2 8441.2 8521.0 8523.0 7249.2 7368.4 7533.6 7578.3 7596.7 7384.4 7446.2 7565.0 7606.4 7634.1 6788.6 6827.0 6883.5 6894.6 6901.7 5131.9 5264.5 5411.2 5425.1 5443.0 5202.3 5245.7 5255.1 5289.7 5301.2 11:31:39 INFO - PROCESS | 6370 | 11:31:39 INFO - PROCESS | 6370 | [#4] prototype.html Cycles:180 Average:4347.81 Median:4848.96 stddev:1239.71 (25.6%) stddev-sans-first:1205.15 11:31:39 INFO - PROCESS | 6370 | Values: 287.8 295.8 310.7 319.8 323.3 5197.5 5245.4 5363.2 5412.8 5432.3 5158.5 5242.3 5273.9 5299.8 5304.4 4110.6 4112.2 4113.8 4133.9 4138.8 3912.9 3914.4 4098.3 4104.2 4157.9 4109.9 4114.3 4115.3 4116.2 4143.4 4098.2 4117.7 4123.1 4143.3 4161.5 3376.4 3669.5 3670.1 3672.5 3690.8 5125.4 5165.0 5185.9 5191.1 5200.8 4714.9 4718.0 4721.9 4729.6 4741.1 5356.4 5450.6 5457.9 5466.2 5500.3 3916.3 3925.8 3932.2 3932.3 3942.3 5717.2 5718.6 5761.0 5780.9 5809.6 3879.9 3978.2 4009.4 4017.8 4022.2 3971.8 3979.3 4002.6 4007.3 4008.4 4573.9 4576.9 4601.7 4616.4 4632.5 5513.4 5539.2 5553.2 5576.2 5591.4 1262.7 1328.8 1367.9 1373.6 1375.4 847.3 858.4 864.2 867.7 878.7 4745.6 4777.4 4794.1 4843.4 4846.5 4959.7 4969.8 4990.9 5003.4 5037.5 4454.9 4663.1 4699.1 4725.6 4745.5 2646.0 2654.8 2680.6 2687.5 2695.3 5087.8 5095.2 5119.5 5142.8 5153.7 4867.2 5090.4 5109.4 5127.0 5140.3 4988.7 5123.7 5125.8 5145.5 5157.5 4979.9 5004.5 5023.9 5067.7 5091.9 4762.8 4861.6 4941.9 4949.7 4967.4 5100.5 5128.6 5131.0 5136.9 5158.3 3533.3 3556.4 3558.4 3558.9 3579.9 4718.6 4979.9 4981.6 4990.8 5035.6 4855.6 4881.8 4897.9 4898.9 4903.0 4829.5 4851.4 4862.4 4874.9 4907.3 4613.3 4744.2 4765.9 4805.0 4830.9 4908.5 4912.8 4947.1 4951.5 4952.3 4713.3 4809.4 4815.9 4869.6 4883.9 11:31:39 INFO - PROCESS | 6370 | 11:31:39 INFO - PROCESS | 6370 | [#5] yui.html Cycles:180 Average:20240.02 Median:25263.51 stddev:28711.60 (113.6%) stddev-sans-first:28754.90 11:31:39 INFO - PROCESS | 6370 | Values: 763.5 769.6 775.9 791.5 796.0 14542.6 14595.9 14741.9 14782.7 14837.6 14648.3 15365.4 15403.5 15451.6 15451.8 652.9 742.2 749.6 782.6 813.8 799.5 811.5 812.2 813.0 813.1 854.3 859.8 860.9 861.3 861.3 679.5 808.8 840.6 848.1 853.2 615.6 616.0 617.2 617.2 617.3 14377.1 14582.0 14589.6 14621.5 14623.7 13649.7 13711.8 13807.7 14045.7 14065.8 12840.6 12943.2 13085.7 13349.3 13857.6 4204.3 4256.7 4317.7 4350.4 4451.7 70550.3 70645.0 71241.6 71364.3 71453.6 10637.8 11333.1 11456.6 11531.8 11915.1 21560.8 21758.7 21761.1 21762.7 21791.3 8204.2 8280.6 8335.5 8337.6 8488.8 4414.2 4432.3 4480.3 4497.7 4692.3 3372.9 3472.7 3473.5 3481.9 3483.2 596.4 607.1 612.2 618.9 626.8 558.5 565.8 580.8 596.8 628.4 9062.5 9078.6 9235.3 9322.4 9487.9 596.4 624.2 645.3 654.4 655.3 4413.2 4570.5 4596.6 4641.3 4708.7 108920.0 109333.5 111585.0 111907.0 112235.4 95934.0 97219.0 97295.0 97302.5 97767.0 80518.2 84247.0 84281.6 84455.0 84761.6 8707.4 8836.4 8857.5 8902.3 9265.8 45956.5 48064.0 48433.5 51786.2 52264.2 48155.3 66870.3 73435.6 77915.6 77974.0 10676.0 10932.6 13178.3 13653.9 13858.6 14910.7 15315.5 15371.2 15401.8 16082.0 13500.0 13685.5 13924.5 14332.9 14896.2 12891.3 13055.3 13391.5 13526.3 13997.4 13704.9 14285.9 14414.7 15036.7 15066.0 11448.2 11871.9 12091.8 12129.0 12189.4 11237.7 11309.0 11681.2 11854.7 11966.9 11:31:39 INFO - PROCESS | 6370 | -------- Summary: end -------- 11:31:39 INFO - PROCESS | 6370 | 11:31:40 INFO - TEST-INFO | 6370: exit 0 11:31:40 INFO - TEST-OK | dromaeo_css | took 1114340ms 11:31:40 INFO - TEST-START | kraken 11:31:40 INFO - operating with platform_type : linux_ 11:31:40 INFO - Initialising browser for kraken test... 11:31:40 INFO - TEST-INFO | started process 6554 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpu8NJ7l/profile http://localhost:47035/getInfo.html) 11:31:44 INFO - PROCESS | 6554 | __metrics Screen width/height:1600/1200 11:31:44 INFO - PROCESS | 6554 | colorDepth:24 11:31:44 INFO - PROCESS | 6554 | Browser inner width/height: 1024/697 11:31:44 INFO - PROCESS | 6554 | __metrics 11:31:45 INFO - PROCESS | 6554 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:31:46 INFO - TEST-INFO | 6554: exit 0 11:31:46 INFO - Browser initialized. 11:31:46 INFO - Running cycle 1/1 for kraken test... 11:31:46 INFO - TEST-INFO | started process 6635 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpu8NJ7l/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:31:58 INFO - PROCESS | 6635 | RSS: Main: 173821952 11:31:58 INFO - PROCESS | 6635 | 11:32:00 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47035/tests/kraken/driver.html?testName=audio-beat-detection) 11:32:01 INFO - PROCESS | 6635 | RSS: Main: 233123840 11:32:01 INFO - PROCESS | 6635 | 11:32:04 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47035/tests/kraken/driver.html?testName=audio-dft) 11:32:04 INFO - PROCESS | 6635 | RSS: Main: 221073408 11:32:04 INFO - PROCESS | 6635 | 11:32:07 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47035/tests/kraken/driver.html?testName=audio-fft) 11:32:08 INFO - PROCESS | 6635 | RSS: Main: 286547968 11:32:08 INFO - PROCESS | 6635 | 11:32:10 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47035/tests/kraken/driver.html?testName=audio-oscillator) 11:32:11 INFO - PROCESS | 6635 | RSS: Main: 197926912 11:32:11 INFO - PROCESS | 6635 | 11:32:13 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47035/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:32:14 INFO - PROCESS | 6635 | RSS: Main: 202268672 11:32:14 INFO - PROCESS | 6635 | 11:32:17 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47035/tests/kraken/driver.html?testName=imaging-darkroom) 11:32:17 INFO - PROCESS | 6635 | RSS: Main: 238186496 11:32:17 INFO - PROCESS | 6635 | 11:32:21 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47035/tests/kraken/driver.html?testName=imaging-desaturate) 11:32:21 INFO - PROCESS | 6635 | RSS: Main: 239091712 11:32:21 INFO - PROCESS | 6635 | 11:32:24 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47035/tests/kraken/driver.html?testName=json-parse-financial) 11:32:25 INFO - PROCESS | 6635 | RSS: Main: 238690304 11:32:25 INFO - PROCESS | 6635 | 11:32:26 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47035/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:32:27 INFO - PROCESS | 6635 | RSS: Main: 228118528 11:32:27 INFO - PROCESS | 6635 | 11:32:29 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47035/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:32:29 INFO - PROCESS | 6635 | RSS: Main: 228941824 11:32:29 INFO - PROCESS | 6635 | 11:32:31 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47035/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:32:32 INFO - PROCESS | 6635 | RSS: Main: 236658688 11:32:32 INFO - PROCESS | 6635 | 11:32:34 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47035/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:32:35 INFO - PROCESS | 6635 | RSS: Main: 239984640 11:32:35 INFO - PROCESS | 6635 | 11:32:38 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47035/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:32:38 INFO - PROCESS | 6635 | RSS: Main: 240410624 11:32:38 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | Cycle 1(1): loaded http://localhost:47035/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47035/tests/kraken/driver.html?testName=ai-astar) 11:32:40 INFO - PROCESS | 6635 | RSS: Main: 283230208 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | __start_tp_report 11:32:40 INFO - PROCESS | 6635 | _x_x_mozilla_page_load 11:32:40 INFO - PROCESS | 6635 | _x_x_mozilla_page_load_details 11:32:40 INFO - PROCESS | 6635 | |i|pagename|runs| 11:32:40 INFO - PROCESS | 6635 | |0;ai-astar;112;106;111;111;110;110;110;114;111;111 11:32:40 INFO - PROCESS | 6635 | |1;audio-beat-detection;147;124;128;173;131;127;166;134;156;124 11:32:40 INFO - PROCESS | 6635 | |2;audio-dft;160;161;161;162;162;163;162;161;160;161 11:32:40 INFO - PROCESS | 6635 | |3;audio-fft;75;75;74;123;77;76;74;75;105;75 11:32:40 INFO - PROCESS | 6635 | |4;audio-oscillator;86;85;116;86;86;87;122;85;86;134 11:32:40 INFO - PROCESS | 6635 | |5;imaging-gaussian-blur;117;117;117;117;117;118;118;118;118;118 11:32:40 INFO - PROCESS | 6635 | |6;imaging-darkroom;146;147;148;146;147;147;147;147;146;147 11:32:40 INFO - PROCESS | 6635 | |7;imaging-desaturate;95;95;94;95;95;95;95;95;95;95 11:32:40 INFO - PROCESS | 6635 | |8;json-parse-financial;54;54;53;53;53;53;53;54;52;53 11:32:40 INFO - PROCESS | 6635 | |9;json-stringify-tinderbox;61;61;61;60;61;60;61;61;61;61 11:32:40 INFO - PROCESS | 6635 | |10;stanford-crypto-aes;80;79;80;85;81;81;82;80;117;88 11:32:40 INFO - PROCESS | 6635 | |11;stanford-crypto-ccm;127;131;122;131;123;119;122;123;141;124 11:32:40 INFO - PROCESS | 6635 | |12;stanford-crypto-pbkdf2;161;168;160;164;167;159;161;166;161;163 11:32:40 INFO - PROCESS | 6635 | |13;stanford-crypto-sha256-iterative;73;64;64;73;63;62;63;63;62;62 11:32:40 INFO - PROCESS | 6635 | __end_tp_report 11:32:40 INFO - PROCESS | 6635 | __start_cc_report 11:32:40 INFO - PROCESS | 6635 | _x_x_mozilla_cycle_collect,1655 11:32:40 INFO - PROCESS | 6635 | __end_cc_report 11:32:40 INFO - PROCESS | 6635 | __startTimestamp1466533960863__endTimestamp 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | ------- Summary: start ------- 11:32:40 INFO - PROCESS | 6635 | Number of tests: 14 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#0] ai-astar Cycles:10 Average:110.60 Median:111.00 stddev:2.01 (1.8%) stddev-sans-first:2.07 11:32:40 INFO - PROCESS | 6635 | Values: 112.0 106.0 111.0 111.0 110.0 110.0 110.0 114.0 111.0 111.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#1] audio-beat-detection Cycles:10 Average:141.00 Median:140.50 stddev:18.26 (13.0%) stddev-sans-first:19.24 11:32:40 INFO - PROCESS | 6635 | Values: 147.0 124.0 128.0 173.0 131.0 127.0 166.0 134.0 156.0 124.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#2] audio-dft Cycles:10 Average:161.30 Median:161.50 stddev:0.95 (0.6%) stddev-sans-first:0.88 11:32:40 INFO - PROCESS | 6635 | Values: 160.0 161.0 161.0 162.0 162.0 163.0 162.0 161.0 160.0 161.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#3] audio-fft Cycles:10 Average:82.90 Median:75.00 stddev:16.95 (22.6%) stddev-sans-first:17.74 11:32:40 INFO - PROCESS | 6635 | Values: 75.0 75.0 74.0 123.0 77.0 76.0 74.0 75.0 105.0 75.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#4] audio-oscillator Cycles:10 Average:97.30 Median:86.00 stddev:18.93 (22.0%) stddev-sans-first:19.63 11:32:40 INFO - PROCESS | 6635 | Values: 86.0 85.0 116.0 86.0 86.0 87.0 122.0 85.0 86.0 134.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#5] imaging-gaussian-blur Cycles:10 Average:117.50 Median:118.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 11:32:40 INFO - PROCESS | 6635 | Values: 117.0 117.0 117.0 117.0 117.0 118.0 118.0 118.0 118.0 118.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#6] imaging-darkroom Cycles:10 Average:146.80 Median:147.00 stddev:0.63 (0.4%) stddev-sans-first:0.60 11:32:40 INFO - PROCESS | 6635 | Values: 146.0 147.0 148.0 146.0 147.0 147.0 147.0 147.0 146.0 147.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#7] imaging-desaturate Cycles:10 Average:94.90 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 11:32:40 INFO - PROCESS | 6635 | Values: 95.0 95.0 94.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#8] json-parse-financial Cycles:10 Average:53.20 Median:53.00 stddev:0.63 (1.2%) stddev-sans-first:0.60 11:32:40 INFO - PROCESS | 6635 | Values: 54.0 54.0 53.0 53.0 53.0 53.0 53.0 54.0 52.0 53.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#9] json-stringify-tinderbox Cycles:10 Average:60.80 Median:61.00 stddev:0.42 (0.7%) stddev-sans-first:0.44 11:32:40 INFO - PROCESS | 6635 | Values: 61.0 61.0 61.0 60.0 61.0 60.0 61.0 61.0 61.0 61.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#10] stanford-crypto-aes Cycles:10 Average:85.30 Median:81.00 stddev:11.47 (14.2%) stddev-sans-first:12.00 11:32:40 INFO - PROCESS | 6635 | Values: 80.0 79.0 80.0 85.0 81.0 81.0 82.0 80.0 117.0 88.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#11] stanford-crypto-ccm Cycles:10 Average:126.30 Median:125.50 stddev:6.48 (5.2%) stddev-sans-first:6.87 11:32:40 INFO - PROCESS | 6635 | Values: 127.0 131.0 122.0 131.0 123.0 119.0 122.0 123.0 141.0 124.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.00 Median:163.50 stddev:3.13 (1.9%) stddev-sans-first:3.23 11:32:40 INFO - PROCESS | 6635 | Values: 161.0 168.0 160.0 164.0 167.0 159.0 161.0 166.0 161.0 163.0 11:32:40 INFO - PROCESS | 6635 | 11:32:40 INFO - PROCESS | 6635 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.90 Median:63.50 stddev:4.33 (6.8%) stddev-sans-first:3.46 11:32:40 INFO - PROCESS | 6635 | Values: 73.0 64.0 64.0 73.0 63.0 62.0 63.0 63.0 62.0 62.0 11:32:40 INFO - PROCESS | 6635 | -------- Summary: end -------- 11:32:40 INFO - PROCESS | 6635 | 11:32:41 INFO - TEST-INFO | 6635: exit 0 11:32:41 INFO - TEST-OK | kraken | took 61822ms 11:32:41 INFO - SUITE-END | took 1176s 11:32:42 INFO - Completed test suite (00:19:36) 11:32:42 INFO - javascript benchmark 11:32:42 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3128.624565052194, 3133.7022982816625, 3149.8740050397987, 3169.667184945582, 3192.984035079824, 5260.053190425722, 5328.413874473805, 5340.973295133524, 5457.399686034533, 5465.617406781522, 5316.840494785162, 5416.241726158341, 5434.402215756264, 5485.61600687952, 5535.0, 4825.541573550507, 4886.047220791947, 4889.33993910821, 4903.705777653335, 5136.306598609196, 5032.245163225527, 5072.188449848025, 5075.873103172414, 5092.8472145835685, 5093.134167191586, 4816.25348071046, 4846.7818948147415, 4872.683275587093, 4928.876778080541, 4952.0, 4782.163121453732, 4792.904141917177, 4799.976000120012, 4865.805367785284, 4907.2639104134305, 4834.927476087862, 4848.951510484885, 4851.466338702739, 4864.391951006124, 4882.316475693406, 5245.973770131163, 5318.22885681574, 5361.169018802092, 5364.195370694388, 5413.106837371829, 5785.103308987113, 5791.594588378815, 5803.0134877071, 5813.883722325572, 5848.67832269225, 5587.720613969285, 5850.385709500526, 5864.354920958691, 5877.970610146965, 5880.941190588125, 5305.336832895888, 5359.196120581905, 5361.544268737123, 5425.159100339375, 5433.049216387117, 5872.442117998783, 5875.735591898375, 5879.676617786063, 5883.117532370179, 5889.5877288590245, 5573.693446860461, 5587.106063029895, 5666.0, 5672.12082127271, 5676.0, 5684.77260909559, 5740.39725828782, 5741.62679425836, 5742.626729262668, 5801.50687191585, 5708.571857110734, 5717.371089180187, 5719.3422756382715, 5722.484976352148, 5723.799667011718, 5588.273524441796, 5691.0, 5702.144678298206, 5724.141378793214, 5737.454941780524, 4358.912821743611, 4372.278574035248, 4372.803223854934, 4402.163588918095, 4411.117776444724, 3903.316919539126, 3924.293627147141, 3932.2135572885536, 3950.2889479893897, 3954.723169378116, 5219.243209734567, 5237.450067742909, 5253.763580638804, 5261.947380526146, 5448.727563621803, 5591.049521581341, 5610.719464026783, 5631.71841407928, 5632.7746890123935, 5633.887322253532, 5324.973375133177, 5331.653442526223, 5331.893362132736, 5335.599830012765, 5392.352917649907, 4839.637027222902, 4844.636652251095, 4849.636277279218, 4887.7556122194455, 4910.533499317559, 5958.582899197015, 5973.253343332083, 5977.760889564455, 5983.521318294526, 6018.488428483628, 5755.107958266475, 5759.596828222152, 5761.48146666802, 5761.711914404179, 5764.36591974874, 5778.711064446677, 5912.852178695395, 5923.614965027259, 5937.970310148422, 5992.400759923973, 5666.744996475086, 5731.942680573307, 5737.168110624019, 5737.856553586027, 5744.224529688438, 5770.538356931519, 5781.479666830005, 5797.420257974169, 5800.1589769484035, 5808.970955145197, 5448.782048718007, 5480.479354461319, 5494.80768173112, 5501.944980550144, 5542.168674698827, 5471.890562188813, 5508.862278443071, 5526.585506086979, 5527.613067085265, 5528.834134975958, 5316.734163291742, 5438.510534051954, 5442.700651464207, 5452.700101494456, 5503.889922201613, 5591.133374326986, 5679.346875109415, 5681.943180568307, 5774.855628609318, 5776.56675749312, 5587.580931430078, 5587.972060139673, 5588.86027849307, 5594.328680558359, 5598.944010560005], "value": 5289.498017461149, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [598.7634884220732, 609.9204408197494, 619.8698273362594, 647.0908373734901, 647.229796542115, 32188.517172242406, 35721.2855742885, 35736.82131589345, 41571.16857662845, 42961.785191074, 45101.0979780405, 45395.09209815802, 45406.772966135126, 45564.77217613907, 45649.31526027104, 8777.736667899957, 8920.8661870072, 8926.687565935194, 8929.33030022751, 8935.329850261223, 8825.691100811473, 8925.553722313858, 8928.062553431893, 8933.95533022334, 8940.642374305053, 8975.95512022439, 9004.819903601923, 9009.099090090971, 9012.324075694316, 9019.0, 8961.103889611019, 8996.685116020908, 9008.819823603557, 9010.86483702745, 9019.909800901973, 8880.111988801133, 8951.32865035125, 8963.507007114606, 8968.955155224246, 8971.775705607412, 42768.3584746229, 43096.3535546967, 43138.0, 43261.0, 43303.13393732108, 3523.5419395478425, 3537.557805274341, 3552.2007548301426, 3894.1822217334393, 4243.533211346749, 32261.354772904644, 32717.6728232717, 32725.836370818233, 32786.836065819756, 32875.01374958755, 4243.377186871831, 4286.063557482652, 4413.955860441419, 4423.402840616508, 4556.658250631216, 346755.0, 347571.0, 349661.0, 351592.0, 352683.0, 57577.0, 57880.421195788345, 58162.0, 58176.70911645499, 58314.0, 62912.68543657252, 63123.684381578714, 63217.367826322065, 63246.36753632497, 63336.68331658404, 15600.84399155994, 15725.135117568414, 15764.921175394049, 15806.288717007763, 15855.682886342209, 12365.134440589072, 12400.379981000913, 12405.503779848705, 12414.75170496585, 12429.0, 14483.78274325886, 15377.308021139075, 15521.534353969399, 15656.921715391578, 15672.0, 5077.720725360066, 5313.628046036741, 5769.624974376736, 5920.407959204132, 6019.367966363557, 957.7797106665506, 962.821877952581, 999.4652860719625, 1026.7627508851815, 1030.577463240068, 32075.19812004672, 32575.140943886992, 32898.0, 32968.505472417935, 33139.83430082834, 1021.2442792333768, 1032.865727455441, 1057.7408534908843, 1077.3266708307308, 1092.448313601626, 16812.579685507717, 17154.914225428794, 17565.47303580869, 17569.79468647012, 17626.735598966025, 514989.0, 523442.0, 527023.0, 527536.0, 527809.0, 56595.71702141463, 56855.715721421126, 56900.0, 57592.0, 57743.71128144332, 1214.763121191377, 1267.524678245658, 1311.7179806341683, 1349.2107117336272, 1356.179511395631, 29482.852585736935, 30790.384192316476, 30897.53653695241, 31281.0, 31393.0, 49946.0, 50135.74932125316, 50443.49556504535, 50578.2413263794, 50715.49284507256, 408724.0, 411647.9417602893, 412135.0, 412499.0, 414852.0, 36669.44995825118, 38287.61712382841, 41849.1630167401, 45488.77255613701, 46523.0, 52357.47642523678, 52736.47263527469, 53394.1990870145, 54190.0, 54438.183427249416, 39910.60089399069, 41534.0, 41670.0, 42025.0, 42416.1516769669, 40362.1927561453, 41010.79494602508, 41011.58988410078, 41877.79061104675, 42080.0, 40410.59589404186, 40832.1833563333, 41451.37822932598, 42384.152316952874, 42666.57333426626, 34118.862638344945, 35988.95750235801, 36605.26789464249, 36666.26667466689, 36806.63193368032, 28632.0, 29306.413871722874, 29324.853375732986, 29334.41331173322, 29418.852905735333], "value": 20059.297504586342, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [379.53127887059486, 386.66746597925794, 386.872332130397, 399.4367941202905, 406.11872237245177, 17880.46358609242, 19776.0, 19923.0, 19930.800691993074, 19932.30236941709, 18022.369217077405, 18178.181981810816, 19003.714944275845, 19246.51883702908, 19264.229430822787, 5475.808346707876, 5590.608657393984, 5651.2653355063785, 5692.459216374438, 5714.314282286132, 5489.204065410533, 5545.611807173499, 5592.972035139818, 5602.299712535933, 5625.40933202014, 5493.450654934514, 5554.305711786027, 5562.471565201299, 5568.749406276707, 5585.1063829787245, 5488.094464413367, 5585.804496842611, 5590.105583106683, 5622.606417550732, 5636.887262254752, 4951.306817045616, 4992.326035985132, 5019.272205530214, 5043.84868453947, 5044.848654540369, 16133.91933040339, 16302.592435189215, 20517.281895133747, 21672.34982950514, 21687.566248675095, 2301.1945818963395, 2309.90760369585, 2331.1491305673476, 2351.306364622423, 2408.2895545814026, 14323.78514322286, 14350.210738409383, 14355.928220358936, 14584.0, 14809.555713328617, 1953.326102494637, 1965.9901700491548, 1970.2513045042936, 2015.7681866585383, 2022.3225219551468, 53371.46628533704, 57708.0, 80875.19124808794, 81118.59440702818, 82542.58728706378, 9740.46427446483, 9786.363886347364, 10380.117689996285, 10632.362058276529, 10641.201909856636, 14511.1293322401, 14591.854081459049, 14597.41610335596, 14599.708005839824, 14623.78064329036, 7571.772846814604, 7848.215178482106, 7921.524708517392, 7964.402669799788, 7983.0, 7421.925780742232, 7540.811479712941, 7605.239476052461, 7711.0746710395115, 7775.883361749578, 6449.161608990895, 6493.155889734304, 6513.218413790375, 6516.0877477153235, 6669.399754022162, 1800.3698705453248, 1816.0, 1843.981560184381, 1888.4376790652373, 1968.0, 918.3066784577601, 949.4255975135083, 976.6435251133286, 989.5942663508071, 1015.751140970467, 18153.909230453763, 18877.905610472135, 19968.60062798765, 20717.58564828725, 20865.68701469479, 930.5951910918636, 963.6290028339, 1021.1371391174446, 1038.413296487482, 1079.222959469181, 9104.681336153202, 10835.349879007284, 11036.834447483294, 11076.335419874833, 11224.607138750267, 535744.0, 541232.0, 541338.0, 542228.0, 559535.0, 65295.673521633034, 82114.0, 83395.0, 100306.49846750866, 100835.49582252042, 1006.0894890124449, 1010.4947526236881, 1040.5785656809155, 1048.7116043088213, 1048.7902419516126, 17549.82450175533, 17695.292188312324, 18122.45632631023, 18200.362987295382, 18309.725354119964, 30808.69191308148, 31059.689403106582, 38506.229875401776, 38573.42139867848, 44124.0, 57265.141022885524, 57780.71109644593, 59800.0, 59938.10092848523, 60196.0, 8466.74599762008, 8711.47731136134, 8786.516741579275, 8904.287656987555, 8947.0, 12845.871541284467, 13222.471101155847, 13693.863061369259, 14103.153810771386, 14125.788113178105, 11852.70368240801, 11895.643130706092, 11926.761464770829, 12029.338386388483, 12175.33035683046, 11697.590584329508, 11760.176787624785, 11891.0, 11989.520419183134, 12058.276503409823, 11624.825627615422, 12035.458404371999, 12136.939315303367, 12518.186317889307, 12563.18339307942, 8627.22354988054, 8628.827423451621, 8649.783755406164, 8832.558372081241, 8896.955515222382, 10560.683179504627, 11864.644060678194, 11903.702407439883, 11983.460744266355, 12709.93645031769], "value": 9237.713541318062, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1283.7239993401417, 1379.6137081617148, 1386.348416244365, 1495.9976815533591, 1731.0911771320054, 7970.880436793445, 8250.75247742568, 8260.876086858701, 8432.704855330065, 8442.451240669352, 8222.91777082229, 8424.620892059856, 8441.746747597566, 8442.746717598482, 8445.61994710238, 2059.794020597943, 2246.4833088389682, 2325.8953347099336, 2326.069572171128, 2354.9411264718347, 2339.631315680329, 2344.6365813298967, 2346.988265058681, 2348.248560460653, 2350.27141586108, 2253.7971582557566, 2279.6124658807958, 2318.0, 2323.268170526287, 2324.535092981402, 2003.1686849957323, 2168.3820111268215, 2246.2811900191946, 2251.74104977928, 2262.230841513885, 2271.7841805028497, 2288.8283378746496, 2292.7363353214428, 2293.7706229377095, 2295.3458264394567, 8578.785530361729, 8651.740447786577, 8659.523726195057, 8663.870041949376, 8682.479051256882, 4767.594754445841, 4893.168161412568, 4901.607871370317, 4901.852944411673, 4902.950970490285, 3238.17426556229, 3387.373072817106, 3396.3546926083964, 3556.057644724124, 3569.7501174917766, 1124.7907022554878, 1154.9711257218637, 1161.8954294113487, 1175.3829239649167, 1191.7318603314272, 11782.587609433629, 11824.408779560987, 11877.049836013099, 11882.227655202385, 11921.821172682417, 4452.710573812692, 4456.5766252205985, 4605.309203619484, 4606.677532572688, 4644.140833945731, 10073.899261007296, 10080.848787268196, 10084.142847857867, 10097.192224622013, 10109.090181883666, 5030.924536131961, 5040.193569028937, 5044.041632089891, 5046.545810877039, 5048.62135339851, 4125.814338354781, 4437.312216606431, 4549.7042692224895, 4579.290210017452, 4629.606483448944, 3799.601041890617, 3810.8666196682984, 3915.393114067324, 3975.6819454443576, 3976.741511801724, 1201.819727040951, 1230.6308107567693, 1240.975180496385, 1258.7922992706285, 1265.4432049898016, 850.927671147947, 853.9957300213459, 913.7487191022389, 948.2366694810744, 966.3380584299778, 5718.857028574235, 5739.799107031234, 5744.913826292609, 5837.007708689533, 5954.285485741739, 433.0775448295111, 1021.4177918586483, 1027.5838285494387, 1032.6488993742164, 1085.571199376242, 4252.277112890816, 4278.101598664315, 4302.978485107555, 4303.913921721548, 4349.217140914602, 10596.09933155675, 10771.730706732395, 10804.405757683402, 10901.945490272497, 10911.127109831354, 9984.101430871111, 10444.112250458644, 10756.300840445347, 10757.462126893624, 10758.139348852073, 7677.500962437423, 7772.8056798579355, 7827.843443131105, 7843.254890785481, 7865.213478652089, 5813.215215945793, 5860.0, 6202.937970620236, 6205.193324867739, 6301.306856245901, 9582.856257156009, 9665.226781857295, 9979.151772099453, 10034.799304014025, 10042.096211341015, 9995.750106247402, 10098.798024039332, 10241.334313269614, 10339.224558158017, 10348.948255258676, 7315.231900650568, 7957.80105497344, 7969.0, 8202.548859812767, 8231.917680823115, 8343.54110523927, 8439.198276163756, 8441.198086181803, 8520.957395212985, 8522.957385213034, 7249.202587715453, 7368.410527157707, 7533.623318834146, 7578.280063393969, 7596.696132154873, 7384.446166537424, 7446.180920098893, 7565.0, 7606.353459955966, 7634.083909930844, 6788.558743681645, 6827.010083537959, 6883.483738719716, 6894.586324820527, 6901.654917254217, 5131.87170320745, 5264.499872512105, 5411.215373770702, 5425.104857698593, 5443.047466693392, 5202.2577144357165, 5245.659032162897, 5255.13290307095, 5289.709066001406, 5301.204819277139], "value": 4553.965791028294, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [287.7582830422446, 295.8180718857902, 310.6939664430537, 319.787341417957, 323.33877221082884, 5197.532222100011, 5245.370555533332, 5363.195520671897, 5412.756425960832, 5432.348118225818, 5158.529819001586, 5242.3184985951775, 5273.947260527393, 5299.788008479656, 5304.389995150559, 4110.609492098246, 4112.1775644870995, 4113.814878330468, 4133.883851360146, 4138.772367519785, 3912.902177445558, 3914.4128380742973, 4098.323776576861, 4104.199681062194, 4157.896052598694, 4109.9178016439655, 4114.341705327149, 4115.341545352744, 4116.238495878272, 4143.399207114981, 4098.159877225176, 4117.6705863531, 4123.134141830219, 4143.316352801784, 4161.500619925598, 3376.3584918865336, 3669.4679271505747, 3670.119171398872, 3672.485851980725, 3690.760100593453, 5125.436202017812, 5165.018646457161, 5185.948140518584, 5191.117510023305, 5200.791968321262, 4714.882127946795, 4718.0, 4721.858344249678, 4729.574338309534, 4741.075490279397, 5356.4107948125675, 5450.574494350016, 5457.86172950555, 5466.234727138204, 5500.28496295483, 3916.2559113768293, 3925.8429662813455, 3932.2135572885536, 3932.2725295820364, 3942.349512330462, 5717.171010203498, 5718.571107166979, 5760.971195143998, 5780.913286300709, 5809.622374545641, 3879.903002424962, 3978.1844721831953, 4009.3785463253244, 4017.7589344639414, 4022.1699126897192, 3971.781552014609, 3979.3036218662196, 4002.599090318365, 4007.2987227235117, 4008.358662614026, 4573.908521829545, 4576.908461830745, 4601.677882548256, 4616.376789133491, 4632.536746325341, 5513.401113677069, 5539.169124631338, 5553.194786755897, 5576.247206627135, 5591.440855914376, 1262.6527704881048, 1328.754180476615, 1367.8715060075278, 1373.5810577773875, 1375.40170026039, 847.3009766942297, 858.3733874271817, 864.2006144316482, 867.7396780965685, 878.7170730733073, 4745.572898439157, 4777.399571143636, 4794.058406345435, 4843.418789745183, 4846.486297434332, 4959.70241785494, 4969.776360063805, 4990.850274491771, 5003.424606170264, 5037.5214354636255, 4454.888627784267, 4663.090697314059, 4699.086566328898, 4725.5510726480925, 4745.549172828576, 2646.0474229277443, 2654.765534026687, 2680.571108622611, 2687.475942191254, 2695.339641787735, 5087.821926232638, 5095.210242412432, 5119.539241468286, 5142.820001300011, 5153.742312884416, 4867.196912509467, 5090.440051594322, 5109.3613298337705, 5126.974365128151, 5140.280360749498, 4988.6757360771435, 5123.666961647481, 5125.7698152443145, 5145.4854514549, 5157.458466860926, 4979.925301120558, 5004.549590536869, 5023.899522009612, 5067.695938243717, 5091.905240373338, 4762.761861906822, 4861.586765125004, 4941.851744447672, 4949.678270912379, 4967.379077615298, 5100.515451032146, 5128.640995130305, 5130.97434512825, 5136.922946155736, 5158.3235448480145, 3533.3463309287863, 3556.395412779885, 3558.3594952908725, 3558.87543935961, 3579.8568057278458, 4718.622510199107, 4979.850604481871, 4981.551660350586, 4990.750462476934, 5035.615205818282, 4855.611551075976, 4881.754392979269, 4897.877553061202, 4898.92651610219, 4902.950970490249, 4829.492903245108, 4851.442084160367, 4862.41651001882, 4874.878128046827, 4907.312976183266, 4613.284940834176, 4744.217204161275, 4765.880852978703, 4805.0, 4830.913044564944, 4908.509149085063, 4912.845481311818, 4947.084789313988, 4951.548983253168, 4952.257161425815, 4713.31656909753, 4809.422869255712, 4815.903681926412, 4869.586085182657, 4883.853484395332], "value": 3948.4888435462685, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [763.5189830406842, 769.6366876748609, 775.8719811231147, 791.5171745235409, 795.9721409750659, 14542.636434089152, 14595.927020364896, 14741.852581474182, 14782.704345913075, 14837.554873353789, 14648.26758662068, 15365.385384584632, 15403.460878869242, 15451.613709657237, 15451.768223476629, 652.8661624367018, 742.220668298286, 749.6326799868052, 782.5695867273006, 813.8453693798159, 799.532273619933, 811.4806523824757, 812.2324403438753, 813.0365516862537, 813.1380736419414, 854.2994744309668, 859.8237361340911, 860.8579584368572, 861.3195575495351, 861.3195575495382, 679.500567083196, 808.7897146741831, 840.6385254340631, 848.0925409811504, 853.21504216121, 615.5937081526216, 616.035903810535, 617.1575799034285, 617.1575799034331, 617.2870334763355, 14377.065490743069, 14582.0, 14589.6352591185, 14621.488247911378, 14623.70752584953, 13649.658758531017, 13711.794323085162, 13807.654808629764, 14045.719085618333, 14065.789013164811, 12840.550580729723, 12943.158694684815, 13085.738285234242, 13349.33253337339, 13857.584272471842, 4204.306289462235, 4256.696206312842, 4317.69776115672, 4350.369196466526, 4451.710638808467, 70550.2944970554, 70645.0, 71241.6437917807, 71364.2863571368, 71453.64273178653, 10637.787244255072, 11333.093352531778, 11456.59901903446, 11531.827022594667, 11915.106367022508, 21560.78439215619, 21758.673619895715, 21761.129554817948, 21762.673559896615, 21791.346259612237, 8204.179582041748, 8280.58597070144, 8335.458195217292, 8337.583120843934, 8488.787780305418, 4414.227510185769, 4432.304488731964, 4480.283154695233, 4497.707649002804, 4692.296155576691, 3372.898813035613, 3472.722182225416, 3473.531073305122, 3481.8781342652887, 3483.1988642611836, 596.3767862583611, 607.1318015238252, 612.185792895448, 618.8947878860605, 626.7837596029362, 558.5168828962999, 565.7821738630574, 580.8344621782771, 596.7702434562638, 628.4406877878691, 9062.546872656472, 9078.606235159315, 9235.261179105655, 9322.440653560672, 9487.857682134774, 596.3767862583611, 624.1605041219552, 645.2708439463377, 654.4469922915129, 655.2791928878196, 4413.205622987829, 4570.474395444567, 4596.6322694185055, 4641.280601506772, 4708.683681821551, 108920.0, 109333.45333273443, 111585.0, 111907.0, 112235.43882280536, 95934.0, 97219.0, 97295.0, 97302.51348743211, 97767.0, 80518.19481805107, 84247.0, 84281.57859210788, 84455.0, 84761.57619211865, 8707.390482666406, 8836.381453298465, 8857.468551886908, 8902.332325075775, 9265.814683706154, 45956.54043459523, 48064.0, 48433.515664842904, 51786.22320665118, 52264.21603676024, 48155.27767083567, 66870.3312966864, 73435.63282183555, 77915.61042194752, 77974.0, 10676.010716999253, 10932.617358392417, 13178.275194864374, 13653.931730341284, 13858.584242472742, 14910.701785964004, 15315.540533784004, 15371.231438428258, 15401.76897346563, 16082.0, 13500.0, 13685.452581896612, 13924.51264205748, 14332.928335358256, 14896.180710061051, 12891.290978996245, 13055.281959492318, 13391.464341426623, 13526.25605591702, 13997.44010239579, 13704.931475342559, 14285.926637961213, 14414.711705766036, 15036.699266014399, 15066.0, 11448.198626096093, 11871.940640296743, 12091.75816483683, 12129.0, 12189.390530473618, 11237.71905702364, 11309.0, 11681.19166512872, 11854.703632409259, 11966.880331196924], "value": 7432.044341320322, "unit": "score"}], "name": "dromaeo_css", "value": 7126.540497745728, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [112.0, 106.0, 111.0, 111.0, 110.0, 110.0, 110.0, 114.0, 111.0, 111.0], "value": 110.6, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 124.0, 128.0, 173.0, 131.0, 127.0, 166.0, 134.0, 156.0, 124.0], "value": 141.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 161.0, 161.0, 162.0, 162.0, 163.0, 162.0, 161.0, 160.0, 161.0], "value": 161.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 74.0, 123.0, 77.0, 76.0, 74.0, 75.0, 105.0, 75.0], "value": 82.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 85.0, 116.0, 86.0, 86.0, 87.0, 122.0, 85.0, 86.0, 134.0], "value": 97.3, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 117.0, 118.0, 118.0, 118.0, 118.0, 118.0], "value": 117.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 147.0, 148.0, 146.0, 147.0, 147.0, 147.0, 147.0, 146.0, 147.0], "value": 146.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 94.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": [54.0, 54.0, 53.0, 53.0, 53.0, 53.0, 53.0, 54.0, 52.0, 53.0], "value": 53.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 61.0, 61.0, 60.0, 61.0, 60.0, 61.0, 61.0, 61.0, 61.0], "value": 60.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 79.0, 80.0, 85.0, 81.0, 81.0, 82.0, 80.0, 117.0, 88.0], "value": 85.3, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [127.0, 131.0, 122.0, 131.0, 123.0, 119.0, 122.0, 123.0, 141.0, 124.0], "value": 126.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 168.0, 160.0, 164.0, 167.0, 159.0, 161.0, 166.0, 161.0, 163.0], "value": 163.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 64.0, 64.0, 73.0, 63.0, 62.0, 63.0, 63.0, 62.0, 62.0], "value": 64.9, "unit": "score"}], "name": "kraken", "value": 1505.8, "alertThreshold": 2.0}]} 11:32:42 INFO - Return code: 0 11:32:42 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:32:42 INFO - # TBPL SUCCESS # 11:32:42 INFO - Running post-action listener: _resource_record_post_action 11:32:42 INFO - ##### 11:32:42 INFO - ##### Finished run-tests step (success) 11:32:42 INFO - ##### 11:32:42 INFO - Running post-run listener: _resource_record_post_run 11:32:42 INFO - Total resource usage - Wall time: 1194s; CPU: 13.0%; Read bytes: 491520; Write bytes: 306921472; Read time: 36; Write time: 293316 11:32:42 INFO - TinderboxPrint: CPU usage
13.3% 11:32:42 INFO - TinderboxPrint: I/O read bytes / time
491,520 / 36 11:32:42 INFO - TinderboxPrint: I/O write bytes / time
306,921,472 / 293,316 11:32:42 INFO - TinderboxPrint: CPU idle
8,259.3 (86.7%) 11:32:42 INFO - TinderboxPrint: CPU user
1,220.3 (12.8%) 11:32:42 INFO - TinderboxPrint: Swap in / out
0 / 0 11:32:42 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 17391616; Read time: 0; Write time: 11200 11:32:42 INFO - run-tests - Wall time: 1178s; CPU: 13.0%; Read bytes: 491520; Write bytes: 289529856; Read time: 36; Write time: 282116 11:32:42 INFO - Running post-run listener: _upload_blobber_files 11:32:42 INFO - Blob upload gear active. 11:32:42 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:32:42 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 11:32:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:32:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:32:43 INFO - (blobuploader) - INFO - Open directory for files ... 11:32:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:32:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:32:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:32:47 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:32:47 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:32:47 INFO - (blobuploader) - INFO - Done attempting. 11:32:47 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 11:32:47 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:32:47 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:32:48 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:32:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:32:48 INFO - (blobuploader) - INFO - Done attempting. 11:32:48 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:32:48 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:32:48 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:32:48 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:32:48 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:32:48 INFO - (blobuploader) - INFO - Done attempting. 11:32:48 INFO - (blobuploader) - INFO - Iteration through files over. 11:32:48 INFO - Return code: 0 11:32:48 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:32:48 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:32:48 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/829bfbef6b89b92f157bfe81e6ea84f7a08e45742f44567029ac5aefca6847277ffa415d538622183da2a4feaf9da883ad2337c3caae5891ae725b5c88b646b6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0b4a4e97c30a36dae6b177ea2096b15439ac15403f4203fbf138347343743bb6d7049ce9c393f00423cc0b4b95dd3744f3265691a783db053b6ef4ebd3e1e46d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8b93f05496339a11eef987df6cbdb9a564f37b850be11cbda8666cc01d714dd334e5947e9e7f3b2097b30038da90f201f20293e2164ada2df2157e3e165898aa"} 11:32:48 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:32:48 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:32:48 INFO - Contents: 11:32:48 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/829bfbef6b89b92f157bfe81e6ea84f7a08e45742f44567029ac5aefca6847277ffa415d538622183da2a4feaf9da883ad2337c3caae5891ae725b5c88b646b6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0b4a4e97c30a36dae6b177ea2096b15439ac15403f4203fbf138347343743bb6d7049ce9c393f00423cc0b4b95dd3744f3265691a783db053b6ef4ebd3e1e46d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8b93f05496339a11eef987df6cbdb9a564f37b850be11cbda8666cc01d714dd334e5947e9e7f3b2097b30038da90f201f20293e2164ada2df2157e3e165898aa"} 11:32:48 INFO - Running post-run listener: copy_logs_to_upload_dir 11:32:48 INFO - Copying logs to upload dir... 11:32:49 INFO - mkdir: /builds/slave/test/build/upload/logs 11:32:49 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.333295 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-06-21 11:32:48.953769) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-21 11:32:48.957527) ========= 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=03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/829bfbef6b89b92f157bfe81e6ea84f7a08e45742f44567029ac5aefca6847277ffa415d538622183da2a4feaf9da883ad2337c3caae5891ae725b5c88b646b6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0b4a4e97c30a36dae6b177ea2096b15439ac15403f4203fbf138347343743bb6d7049ce9c393f00423cc0b4b95dd3744f3265691a783db053b6ef4ebd3e1e46d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8b93f05496339a11eef987df6cbdb9a564f37b850be11cbda8666cc01d714dd334e5947e9e7f3b2097b30038da90f201f20293e2164ada2df2157e3e165898aa"} build_url:https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011485 build_url: 'https://queue.taskcluster.net/v1/task/aMV7shOCS1eptfHjzLhAxA/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/sha512/829bfbef6b89b92f157bfe81e6ea84f7a08e45742f44567029ac5aefca6847277ffa415d538622183da2a4feaf9da883ad2337c3caae5891ae725b5c88b646b6", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/0b4a4e97c30a36dae6b177ea2096b15439ac15403f4203fbf138347343743bb6d7049ce9c393f00423cc0b4b95dd3744f3265691a783db053b6ef4ebd3e1e46d", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/8b93f05496339a11eef987df6cbdb9a564f37b850be11cbda8666cc01d714dd334e5947e9e7f3b2097b30038da90f201f20293e2164ada2df2157e3e165898aa"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-21 11:32:48.983390) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:32:48.983719) ========= 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=03627c79f6bb3d1578c4a402000001ba-1466532727.41851-1433463248 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004602 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-21 11:32:49.068690) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-21 11:32:49.069098) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-21 11:32:49.069455) ========= ========= Total master_lag: 1.90 =========