builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-002 starttime: 1465300642.94 results: success (0) buildid: 20160607023009 builduid: a910ca6b4951493db05745f6650c5535 revision: c227ee36b4844af150165c64e13347f483db8284 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:22.940891) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:22.941259) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:22.941532) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:23.282657) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:23.282935) ========= 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=a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-07 04:57:23-- 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% 223M=0s 2016-06-07 04:57:23 (223 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.076643 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:23.380214) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:23.380489) ========= 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=a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019371 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:23.435048) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:23.435354) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev c227ee36b4844af150165c64e13347f483db8284 --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 c227ee36b4844af150165c64e13347f483db8284 --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=a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-07 04:57:23,906 truncating revision to first 12 chars 2016-06-07 04:57:23,906 Setting DEBUG logging. 2016-06-07 04:57:23,906 attempt 1/10 2016-06-07 04:57:23,906 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/c227ee36b484?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-07 04:57:24,236 unpacking tar archive at: fx-team-c227ee36b484/testing/mozharness/ program finished with exit code 0 elapsedTime=0.656985 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:24.108618) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:24.109315) ========= script_repo_revision: c227ee36b4844af150165c64e13347f483db8284 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:24.110270) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:24.111222) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-07 04:57:24.122425) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-06-07 04:57:24.123079) ========= /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=a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:57:24 INFO - MultiFileLogger online at 20160607 04:57:24 in /builds/slave/test 04:57:24 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 04:57:24 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:57:24 INFO - {'append_to_log': False, 04:57:24 INFO - 'base_work_dir': '/builds/slave/test', 04:57:24 INFO - 'blob_upload_branch': 'Fx-Team', 04:57:24 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:57:24 INFO - 'branch': 'Fx-Team', 04:57:24 INFO - 'buildbot_json_path': 'buildprops.json', 04:57:24 INFO - 'config_files': ('talos/linux_config.py',), 04:57:24 INFO - 'default_actions': ('clobber', 04:57:24 INFO - 'read-buildbot-config', 04:57:24 INFO - 'download-and-extract', 04:57:24 INFO - 'populate-webroot', 04:57:24 INFO - 'create-virtualenv', 04:57:24 INFO - 'install', 04:57:24 INFO - 'run-tests'), 04:57:24 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:57:24 INFO - 'download_minidump_stackwalk': True, 04:57:24 INFO - 'download_symbols': 'ondemand', 04:57:24 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:57:24 INFO - 'tooltool.py': '/tools/tooltool.py', 04:57:24 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:57:24 INFO - '/tools/misc-python/virtualenv.py')}, 04:57:24 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:57:24 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:57:24 INFO - 'installer_path': 'installer.exe', 04:57:24 INFO - 'log_level': 'info', 04:57:24 INFO - 'log_name': 'talos', 04:57:24 INFO - 'log_to_console': True, 04:57:24 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:57:24 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:57:24 INFO - 'opt_config_files': (), 04:57:24 INFO - 'pip_index': False, 04:57:24 INFO - 'sps_profile': False, 04:57:24 INFO - 'sps_profile_interval': 0, 04:57:24 INFO - 'suite': 'dromaeojs', 04:57:24 INFO - 'system_bits': '32', 04:57:24 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:57:24 INFO - 'title': 'talos-linux64-ix-002', 04:57:24 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:57:24 INFO - 'use_talos_json': True, 04:57:24 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:57:24 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:57:24 INFO - 'work_dir': 'build'} 04:57:24 INFO - ##### 04:57:24 INFO - ##### Running clobber step. 04:57:24 INFO - ##### 04:57:24 INFO - Running pre-action listener: _resource_record_pre_action 04:57:24 INFO - Running main action method: clobber 04:57:24 INFO - rmtree: /builds/slave/test/build 04:57:24 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:57:25 INFO - Running post-action listener: _resource_record_post_action 04:57:25 INFO - ##### 04:57:25 INFO - ##### Finished clobber step (success) 04:57:25 INFO - ##### 04:57:25 INFO - ##### 04:57:25 INFO - ##### Running read-buildbot-config step. 04:57:25 INFO - ##### 04:57:25 INFO - Running pre-action listener: _resource_record_pre_action 04:57:25 INFO - Running main action method: read_buildbot_config 04:57:25 INFO - Using buildbot properties: 04:57:25 INFO - { 04:57:25 INFO - "project": "", 04:57:25 INFO - "product": "firefox", 04:57:25 INFO - "script_repo_revision": "production", 04:57:25 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 04:57:25 INFO - "repository": "", 04:57:25 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 04:57:25 INFO - "buildid": "20160607023009", 04:57:25 INFO - "pgo_build": "True", 04:57:25 INFO - "basedir": "/builds/slave/test", 04:57:25 INFO - "buildnumber": 1232, 04:57:25 INFO - "slavename": "talos-linux64-ix-002", 04:57:25 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 04:57:25 INFO - "platform": "ubuntu64_hw", 04:57:25 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 04:57:25 INFO - "branch": "fx-team", 04:57:25 INFO - "repo_path": "integration/fx-team", 04:57:25 INFO - "revision": "c227ee36b4844af150165c64e13347f483db8284", 04:57:25 INFO - "stage_platform": "linux64-pgo", 04:57:25 INFO - "builduid": "a910ca6b4951493db05745f6650c5535", 04:57:25 INFO - "slavebuilddir": "test" 04:57:25 INFO - } 04:57:25 INFO - Found installer url https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 04:57:25 INFO - Running post-action listener: _resource_record_post_action 04:57:25 INFO - ##### 04:57:25 INFO - ##### Finished read-buildbot-config step (success) 04:57:25 INFO - ##### 04:57:25 INFO - ##### 04:57:25 INFO - ##### Running download-and-extract step. 04:57:25 INFO - ##### 04:57:25 INFO - Running pre-action listener: _resource_record_pre_action 04:57:25 INFO - Running main action method: download_and_extract 04:57:25 INFO - mkdir: /builds/slave/test/build/tests 04:57: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')]} 04:57:25 INFO - https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 04:57:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 04:57:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 04:57:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:30 INFO - Downloaded 1361 bytes. 04:57:30 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 04:57:30 INFO - Using the following test package requirements: 04:57:30 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 04:57:30 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:57:30 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:57:30 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:57:30 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 04:57:30 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:57:30 INFO - u'jsshell-linux-x86_64.zip'], 04:57:30 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:57:30 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:57:30 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 04:57:30 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:57:30 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:57:30 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:57:30 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:57:30 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:57:30 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:57:30 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 04:57:30 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:57:30 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:57: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')]} 04:57:30 INFO - https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:57:30 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:57:30 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:57:30 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:30 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:32 INFO - Downloaded 24444404 bytes. 04:57:32 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'] 04:57:32 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 04:57:33 INFO - Return code: 0 04:57:33 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 04:57: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')]} 04:57:33 INFO - https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:57:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:57:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 04:57:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:35 INFO - Downloaded 24444404 bytes. 04:57:35 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'] 04:57:35 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 04:57:36 INFO - Return code: 0 04:57: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')]} 04:57:36 INFO - https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:57:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 04:57:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 04:57:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:37 INFO - Downloaded 10833369 bytes. 04:57:37 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'] 04:57:37 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 04:57:38 INFO - Return code: 0 04:57:38 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:57:38 INFO - https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:57:38 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 04:57:38 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 04:57:38 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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 04:57:40 INFO - Downloaded 59201006 bytes. 04:57:40 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 04:57:40 INFO - mkdir: /builds/slave/test/properties 04:57:40 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:57:40 INFO - Writing to file /builds/slave/test/properties/build_url 04:57:40 INFO - Contents: 04:57:40 INFO - build_url:https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 04:57:40 INFO - Running post-action listener: _resource_record_post_action 04:57:40 INFO - Running post-action listener: set_extra_try_arguments 04:57:40 INFO - ##### 04:57:40 INFO - ##### Finished download-and-extract step (success) 04:57:40 INFO - ##### 04:57:40 INFO - ##### 04:57:40 INFO - ##### Running populate-webroot step. 04:57:40 INFO - ##### 04:57:40 INFO - Running pre-action listener: _resource_record_pre_action 04:57:40 INFO - Running main action method: populate_webroot 04:57:40 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:57:40 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:57:40 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:57:40 INFO - '--tppagecycles', 04:57:40 INFO - '7'], 04:57:40 INFO - 'tests': ['tsvgm']}}, 04:57:40 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:57:40 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:57:40 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:57:40 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:57:40 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:57:40 INFO - 'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:57:40 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:57:40 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:57:40 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:57:40 INFO - 'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['damp', 'tps']}, 04:57:40 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:57:40 INFO - 'tests': ['damp', 'tps']}, 04:57:40 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['dromaeo_dom']}, 04:57:40 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:57:40 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['a11yr', 04:57:40 INFO - 'ts_paint', 04:57:40 INFO - 'tpaint', 04:57:40 INFO - 'sessionrestore', 04:57:40 INFO - 'sessionrestore_no_auto_restore', 04:57:40 INFO - 'tabpaint']}, 04:57:40 INFO - 'other-e10s': {'tests': ['a11yr', 04:57:40 INFO - 'ts_paint', 04:57:40 INFO - 'tpaint', 04:57:40 INFO - 'sessionrestore', 04:57:40 INFO - 'sessionrestore_no_auto_restore', 04:57:40 INFO - 'tabpaint']}, 04:57:40 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:57:40 INFO - 'ts_paint', 04:57:40 INFO - 'tpaint', 04:57:40 INFO - 'sessionrestore', 04:57:40 INFO - 'sessionrestore_no_auto_restore', 04:57:40 INFO - 'tabpaint']}, 04:57:40 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:57:40 INFO - 'ts_paint', 04:57:40 INFO - 'tpaint', 04:57:40 INFO - 'sessionrestore', 04:57:40 INFO - 'sessionrestore_no_auto_restore', 04:57:40 INFO - 'tabpaint']}, 04:57:40 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['a11yr', 04:57:40 INFO - 'ts_paint', 04:57:40 INFO - 'tpaint', 04:57:40 INFO - 'sessionrestore', 04:57:40 INFO - 'sessionrestore_no_auto_restore', 04:57:40 INFO - 'tabpaint']}, 04:57:40 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['a11yr', 04:57:40 INFO - 'ts_paint', 04:57:40 INFO - 'tpaint', 04:57:40 INFO - 'sessionrestore', 04:57:40 INFO - 'sessionrestore_no_auto_restore', 04:57:40 INFO - 'tabpaint']}, 04:57:40 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['tsvgx', 04:57:40 INFO - 'tsvgr_opacity', 04:57:40 INFO - 'tart', 04:57:40 INFO - 'tscrollx', 04:57:40 INFO - 'cart']}, 04:57:40 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:57:40 INFO - 'tsvgr_opacity', 04:57:40 INFO - 'tart', 04:57:40 INFO - 'tscrollx', 04:57:40 INFO - 'cart']}, 04:57:40 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:57:40 INFO - 'talos_options': ['--disable-e10s'], 04:57:40 INFO - 'tests': ['tp5o']}, 04:57:40 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:57:40 INFO - 'tests': ['tp5o']}, 04:57:40 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:57:40 INFO - 'talos_options': ['--disable-e10s', 04:57:40 INFO - '--xperf_path', 04:57:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:57:40 INFO - 'tests': ['tp5n']}, 04:57:40 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:57:40 INFO - 'talos_options': ['--xperf_path', 04:57:40 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:57:40 INFO - 'tests': ['tp5n']}}, 04:57:40 INFO - 'talos.zip': {'path': '', 04:57:40 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:57:40 INFO - Running post-action listener: _resource_record_post_action 04:57:40 INFO - ##### 04:57:40 INFO - ##### Finished populate-webroot step (success) 04:57:40 INFO - ##### 04:57:40 INFO - ##### 04:57:40 INFO - ##### Running create-virtualenv step. 04:57:40 INFO - ##### 04:57:40 INFO - Running pre-action listener: _resource_record_pre_action 04:57:40 INFO - Running main action method: create_virtualenv 04:57:40 INFO - Creating virtualenv /builds/slave/test/build/venv 04:57:40 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 04:57:40 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:57:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:57:40 INFO - Using real prefix '/usr' 04:57:40 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:57:41 INFO - Installing distribute.............................................................................................................................................................................................done. 04:57:43 INFO - Installing pip.................done. 04:57:43 INFO - Return code: 0 04:57:43 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:57: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')]} 04:57:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:57:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57: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')]} 04:57:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:57:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:57: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', 'pip>=1.5'] in /builds/slave/test/build 04:57: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 pip>=1.5 04:57:43 INFO - Using env: {'DISPLAY': ':0', 04:57:43 INFO - 'HOME': '/home/cltbld', 04:57:43 INFO - 'LANG': 'en_US.UTF-8', 04:57:43 INFO - 'LANGUAGE': 'en_US:en', 04:57:43 INFO - 'LOGNAME': 'cltbld', 04:57:43 INFO - 'MAIL': '/var/mail/cltbld', 04:57:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:57:43 INFO - 'MOZ_NO_REMOTE': '1', 04:57:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:57:43 INFO - 'NO_EM_RESTART': '1', 04:57:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:57:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:57:43 INFO - 'PWD': '/builds/slave/test', 04:57:43 INFO - 'SHELL': '/bin/bash', 04:57:43 INFO - 'SHLVL': '1', 04:57:43 INFO - 'TERM': 'linux', 04:57:43 INFO - 'TMOUT': '86400', 04:57:43 INFO - 'USER': 'cltbld', 04:57:43 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:57:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:57:43 INFO - '_': '/tools/buildbot/bin/python'} 04:57:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:57:43 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 04:57:43 INFO - Cleaning up... 04:57:43 INFO - Return code: 0 04:57:43 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:57: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')]} 04:57:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:57:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57: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')]} 04:57:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:57:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57: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', '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 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:57: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', 'psutil>=3.1.1'] in /builds/slave/test/build 04:57: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 psutil>=3.1.1 04:57:43 INFO - Using env: {'DISPLAY': ':0', 04:57:43 INFO - 'HOME': '/home/cltbld', 04:57:43 INFO - 'LANG': 'en_US.UTF-8', 04:57:43 INFO - 'LANGUAGE': 'en_US:en', 04:57:43 INFO - 'LOGNAME': 'cltbld', 04:57:43 INFO - 'MAIL': '/var/mail/cltbld', 04:57:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:57:43 INFO - 'MOZ_NO_REMOTE': '1', 04:57:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:57:43 INFO - 'NO_EM_RESTART': '1', 04:57:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:57:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:57:43 INFO - 'PWD': '/builds/slave/test', 04:57:43 INFO - 'SHELL': '/bin/bash', 04:57:43 INFO - 'SHLVL': '1', 04:57:43 INFO - 'TERM': 'linux', 04:57:43 INFO - 'TMOUT': '86400', 04:57:43 INFO - 'USER': 'cltbld', 04:57:43 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:57:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:57:43 INFO - '_': '/tools/buildbot/bin/python'} 04:57:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:57:43 INFO - Downloading/unpacking psutil>=3.1.1 04:57:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:57:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:57:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:57:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:57:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:57:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:57:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:57:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:57:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:57:45 INFO - Installing collected packages: psutil 04:57:45 INFO - Running setup.py install for psutil 04:57:45 INFO - building 'psutil._psutil_linux' extension 04:57:45 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 04:57:46 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 04:57:46 INFO - building 'psutil._psutil_posix' extension 04:57:46 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 04:57:46 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 04:57:46 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:57:46 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:57:46 INFO - Successfully installed psutil 04:57:46 INFO - Cleaning up... 04:57:46 INFO - Return code: 0 04:57:46 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:57:46 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')]} 04:57:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:57:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:46 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')]} 04:57:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:57:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:46 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 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:57:46 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 04:57:46 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 04:57:46 INFO - Using env: {'DISPLAY': ':0', 04:57:46 INFO - 'HOME': '/home/cltbld', 04:57:46 INFO - 'LANG': 'en_US.UTF-8', 04:57:46 INFO - 'LANGUAGE': 'en_US:en', 04:57:46 INFO - 'LOGNAME': 'cltbld', 04:57:46 INFO - 'MAIL': '/var/mail/cltbld', 04:57:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:57:46 INFO - 'MOZ_NO_REMOTE': '1', 04:57:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:57:46 INFO - 'NO_EM_RESTART': '1', 04:57:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:57:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:57:46 INFO - 'PWD': '/builds/slave/test', 04:57:46 INFO - 'SHELL': '/bin/bash', 04:57:46 INFO - 'SHLVL': '1', 04:57:46 INFO - 'TERM': 'linux', 04:57:46 INFO - 'TMOUT': '86400', 04:57:46 INFO - 'USER': 'cltbld', 04:57:46 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:57:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:57:46 INFO - '_': '/tools/buildbot/bin/python'} 04:57:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:57:46 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:57: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 04:57: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 04:57: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 04:57: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 04:57: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 04:57: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 04:57:48 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:57:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:57:48 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:57:48 INFO - Installing collected packages: mozsystemmonitor 04:57:48 INFO - Running setup.py install for mozsystemmonitor 04:57:48 INFO - Successfully installed mozsystemmonitor 04:57:48 INFO - Cleaning up... 04:57:48 INFO - Return code: 0 04:57:48 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:57:48 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')]} 04:57:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:57:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:48 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')]} 04:57:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:57:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:48 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 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:57:48 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 04:57:48 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 04:57:48 INFO - Using env: {'DISPLAY': ':0', 04:57:48 INFO - 'HOME': '/home/cltbld', 04:57:48 INFO - 'LANG': 'en_US.UTF-8', 04:57:48 INFO - 'LANGUAGE': 'en_US:en', 04:57:48 INFO - 'LOGNAME': 'cltbld', 04:57:48 INFO - 'MAIL': '/var/mail/cltbld', 04:57:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:57:48 INFO - 'MOZ_NO_REMOTE': '1', 04:57:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:57:48 INFO - 'NO_EM_RESTART': '1', 04:57:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:57:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:57:48 INFO - 'PWD': '/builds/slave/test', 04:57:48 INFO - 'SHELL': '/bin/bash', 04:57:48 INFO - 'SHLVL': '1', 04:57:48 INFO - 'TERM': 'linux', 04:57:48 INFO - 'TMOUT': '86400', 04:57:48 INFO - 'USER': 'cltbld', 04:57:48 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:57:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:57:48 INFO - '_': '/tools/buildbot/bin/python'} 04:57:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:57:48 INFO - Downloading/unpacking jsonschema==2.5.1 04:57:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:57:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:57:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:57:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:57:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:57:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:57:50 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:57:50 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:57:50 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 04:57:50 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 04:57:50 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 04:57:50 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 04:57:50 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 04:57:50 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 04:57:50 INFO - Downloading functools32-3.2.3-2.tar.gz 04:57:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:57:50 INFO - warning: no files found matching '*.txt' 04:57:50 INFO - no previously-included directories found matching 'build' 04:57:50 INFO - no previously-included directories found matching 'dist' 04:57:50 INFO - no previously-included directories found matching '.git*' 04:57:51 INFO - Installing collected packages: jsonschema, functools32 04:57:51 INFO - Running setup.py install for functools32 04:57:51 INFO - warning: no files found matching '*.txt' 04:57:51 INFO - no previously-included directories found matching 'build' 04:57:51 INFO - no previously-included directories found matching 'dist' 04:57:51 INFO - no previously-included directories found matching '.git*' 04:57:51 INFO - Successfully installed jsonschema functools32 04:57:51 INFO - Cleaning up... 04:57:51 INFO - Return code: 0 04:57:51 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:57:51 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')]} 04:57:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:57:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:51 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')]} 04:57:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:57:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:51 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 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:57:51 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 04:57:51 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 04:57:51 INFO - Using env: {'DISPLAY': ':0', 04:57:51 INFO - 'HOME': '/home/cltbld', 04:57:51 INFO - 'LANG': 'en_US.UTF-8', 04:57:51 INFO - 'LANGUAGE': 'en_US:en', 04:57:51 INFO - 'LOGNAME': 'cltbld', 04:57:51 INFO - 'MAIL': '/var/mail/cltbld', 04:57:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:57:51 INFO - 'MOZ_NO_REMOTE': '1', 04:57:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:57:51 INFO - 'NO_EM_RESTART': '1', 04:57:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:57:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:57:51 INFO - 'PWD': '/builds/slave/test', 04:57:51 INFO - 'SHELL': '/bin/bash', 04:57:51 INFO - 'SHLVL': '1', 04:57:51 INFO - 'TERM': 'linux', 04:57:51 INFO - 'TMOUT': '86400', 04:57:51 INFO - 'USER': 'cltbld', 04:57:51 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:57:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:57:51 INFO - '_': '/tools/buildbot/bin/python'} 04:57:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:57:51 INFO - Downloading/unpacking blobuploader==1.2.4 04:57:51 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 04:57:51 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 04:57:51 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 04:57:51 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 04:57:51 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 04:57:51 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 04:57:53 INFO - Downloading blobuploader-1.2.4.tar.gz 04:57:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:57:53 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:57:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:57:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:57:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:57:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:57:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:57:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:57:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:57:53 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:57:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:57:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:57:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:57:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:57:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:57:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:57:54 INFO - Downloading docopt-0.6.1.tar.gz 04:57:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:57:54 INFO - Installing collected packages: blobuploader, requests, docopt 04:57:54 INFO - Running setup.py install for blobuploader 04:57:54 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:57:54 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:57:54 INFO - Running setup.py install for requests 04:57:54 INFO - Running setup.py install for docopt 04:57:54 INFO - Successfully installed blobuploader requests docopt 04:57:54 INFO - Cleaning up... 04:57:54 INFO - Return code: 0 04:57:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:57:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:57:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:57:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:57:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:57:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:54 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 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:57:54 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 04:57:54 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 04:57:54 INFO - Using env: {'DISPLAY': ':0', 04:57:54 INFO - 'HOME': '/home/cltbld', 04:57:54 INFO - 'LANG': 'en_US.UTF-8', 04:57:54 INFO - 'LANGUAGE': 'en_US:en', 04:57:54 INFO - 'LOGNAME': 'cltbld', 04:57:54 INFO - 'MAIL': '/var/mail/cltbld', 04:57:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:57:54 INFO - 'MOZ_NO_REMOTE': '1', 04:57:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:57:54 INFO - 'NO_EM_RESTART': '1', 04:57:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:57:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:57:54 INFO - 'PWD': '/builds/slave/test', 04:57:54 INFO - 'SHELL': '/bin/bash', 04:57:54 INFO - 'SHLVL': '1', 04:57:54 INFO - 'TERM': 'linux', 04:57:54 INFO - 'TMOUT': '86400', 04:57:54 INFO - 'USER': 'cltbld', 04:57:54 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:57:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:57:54 INFO - '_': '/tools/buildbot/bin/python'} 04:57:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:57:55 INFO - Running setup.py (path:/tmp/pip-o_ph68-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:57:55 INFO - Running setup.py (path:/tmp/pip-kGgTuZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:57:55 INFO - Running setup.py (path:/tmp/pip-GLsQHI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:57:55 INFO - Running setup.py (path:/tmp/pip-mE5RDO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:57:55 INFO - Running setup.py (path:/tmp/pip-tqoVmI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:57:55 INFO - Running setup.py (path:/tmp/pip-uiLJAr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:57:55 INFO - Running setup.py (path:/tmp/pip-JOE3LL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:57:55 INFO - Running setup.py (path:/tmp/pip-tItehA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:57:55 INFO - Running setup.py (path:/tmp/pip-r4_aSK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:57:55 INFO - Running setup.py (path:/tmp/pip-FCOC7t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:57:55 INFO - Running setup.py (path:/tmp/pip-l1_2Z3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:57:55 INFO - Running setup.py (path:/tmp/pip-0Wq7R5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:57:55 INFO - Running setup.py (path:/tmp/pip-xcAwsu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:57:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:57:55 INFO - Running setup.py (path:/tmp/pip-4CHEN0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:57:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:57:56 INFO - Running setup.py (path:/tmp/pip-vn54Vi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:57:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:57:56 INFO - Running setup.py (path:/tmp/pip-nuEk7T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:57:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:57:56 INFO - Running setup.py (path:/tmp/pip-HjT73D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:57:56 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:57:56 INFO - Running setup.py install for manifestparser 04:57:56 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:57:56 INFO - Running setup.py install for mozcrash 04:57:56 INFO - Running setup.py install for mozdebug 04:57:56 INFO - Running setup.py install for mozdevice 04:57:56 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:57:56 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:57:56 INFO - Running setup.py install for mozfile 04:57:56 INFO - Running setup.py install for mozhttpd 04:57:56 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:57:56 INFO - Running setup.py install for mozinfo 04:57:56 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:57:56 INFO - Running setup.py install for mozInstall 04:57:57 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Running setup.py install for mozleak 04:57:57 INFO - Running setup.py install for mozlog 04:57:57 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Running setup.py install for moznetwork 04:57:57 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Running setup.py install for mozprocess 04:57:57 INFO - Running setup.py install for mozprofile 04:57:57 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Running setup.py install for mozrunner 04:57:57 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:57:57 INFO - Running setup.py install for mozscreenshot 04:57:57 INFO - Running setup.py install for moztest 04:57:57 INFO - Running setup.py install for mozversion 04:57:57 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:57:58 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:57:58 INFO - Cleaning up... 04:57:58 INFO - Return code: 0 04:57:58 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:57:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:57:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:57:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:57:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:57:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:57:58 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 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:57:58 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 04:57:58 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 04:57:58 INFO - Using env: {'DISPLAY': ':0', 04:57:58 INFO - 'HOME': '/home/cltbld', 04:57:58 INFO - 'LANG': 'en_US.UTF-8', 04:57:58 INFO - 'LANGUAGE': 'en_US:en', 04:57:58 INFO - 'LOGNAME': 'cltbld', 04:57:58 INFO - 'MAIL': '/var/mail/cltbld', 04:57:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:57:58 INFO - 'MOZ_NO_REMOTE': '1', 04:57:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:57:58 INFO - 'NO_EM_RESTART': '1', 04:57:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:57:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:57:58 INFO - 'PWD': '/builds/slave/test', 04:57:58 INFO - 'SHELL': '/bin/bash', 04:57:58 INFO - 'SHLVL': '1', 04:57:58 INFO - 'TERM': 'linux', 04:57:58 INFO - 'TMOUT': '86400', 04:57:58 INFO - 'USER': 'cltbld', 04:57:58 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:57:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:57:58 INFO - '_': '/tools/buildbot/bin/python'} 04:57:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:57:58 INFO - Running setup.py (path:/tmp/pip-yfbCeQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:57:58 INFO - Running setup.py (path:/tmp/pip-WWSWx1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:57:58 INFO - Running setup.py (path:/tmp/pip-yHjA_T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:57:58 INFO - Running setup.py (path:/tmp/pip-pn4_1B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:57:58 INFO - Running setup.py (path:/tmp/pip-0eXAcw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:57:58 INFO - Running setup.py (path:/tmp/pip-BeyA3D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:57:58 INFO - Running setup.py (path:/tmp/pip-7jzkMM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:57:58 INFO - Running setup.py (path:/tmp/pip-dd_TXJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:57:58 INFO - Running setup.py (path:/tmp/pip-2oYxPf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:57:58 INFO - Running setup.py (path:/tmp/pip-DIZu0A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:57:58 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)) 04:57:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:57:58 INFO - Running setup.py (path:/tmp/pip-7MUber-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:57:59 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)) 04:57:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:57:59 INFO - Running setup.py (path:/tmp/pip-sIaMv9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:57:59 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)) 04:57:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:57:59 INFO - Running setup.py (path:/tmp/pip-ZYMqYE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:57:59 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)) 04:57:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:57:59 INFO - Running setup.py (path:/tmp/pip-aGzAAT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:57:59 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)) 04:57:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:57:59 INFO - Running setup.py (path:/tmp/pip-WDOjj1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:57:59 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)) 04:57:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:57:59 INFO - Running setup.py (path:/tmp/pip-9oijVK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:57:59 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)) 04:57:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:57:59 INFO - Running setup.py (path:/tmp/pip-RADycb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:57:59 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)) 04:57:59 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)) 04:57:59 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)) 04:57:59 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)) 04:57:59 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)) 04:57:59 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)) 04:57:59 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:57:59 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 04:57:59 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 04:57:59 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 04:57:59 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 04:57:59 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 04:57:59 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 04:58:01 INFO - Downloading blessings-1.6.tar.gz 04:58:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:58:01 INFO - Installing collected packages: blessings 04:58:01 INFO - Running setup.py install for blessings 04:58:01 INFO - Successfully installed blessings 04:58:01 INFO - Cleaning up... 04:58:01 INFO - Return code: 0 04:58:01 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:58:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:58:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:58:02 INFO - Reading from file tmpfile_stdout 04:58:02 INFO - Current package versions: 04:58:02 INFO - argparse == 1.2.1 04:58:02 INFO - blessings == 1.6 04:58:02 INFO - blobuploader == 1.2.4 04:58:02 INFO - docopt == 0.6.1 04:58:02 INFO - functools32 == 3.2.3-2 04:58:02 INFO - jsonschema == 2.5.1 04:58:02 INFO - manifestparser == 1.1 04:58:02 INFO - mozInstall == 1.12 04:58:02 INFO - mozcrash == 0.17 04:58:02 INFO - mozdebug == 0.1 04:58:02 INFO - mozdevice == 0.48 04:58:02 INFO - mozfile == 1.2 04:58:02 INFO - mozhttpd == 0.7 04:58:02 INFO - mozinfo == 0.9 04:58:02 INFO - mozleak == 0.1 04:58:02 INFO - mozlog == 3.2 04:58:02 INFO - moznetwork == 0.27 04:58:02 INFO - mozprocess == 0.22 04:58:02 INFO - mozprofile == 0.28 04:58:02 INFO - mozrunner == 6.11 04:58:02 INFO - mozscreenshot == 0.1 04:58:02 INFO - mozsystemmonitor == 0.3 04:58:02 INFO - moztest == 0.7 04:58:02 INFO - mozversion == 1.4 04:58:02 INFO - psutil == 3.1.1 04:58:02 INFO - requests == 1.2.3 04:58:02 INFO - wsgiref == 0.1.2 04:58:02 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:58:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:58:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:58:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:58:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:58:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:58:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:58:02 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 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:58:02 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 04:58:02 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 04:58:02 INFO - Using env: {'DISPLAY': ':0', 04:58:02 INFO - 'HOME': '/home/cltbld', 04:58:02 INFO - 'LANG': 'en_US.UTF-8', 04:58:02 INFO - 'LANGUAGE': 'en_US:en', 04:58:02 INFO - 'LOGNAME': 'cltbld', 04:58:02 INFO - 'MAIL': '/var/mail/cltbld', 04:58:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:58:02 INFO - 'MOZ_NO_REMOTE': '1', 04:58:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:58:02 INFO - 'NO_EM_RESTART': '1', 04:58:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:58:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:58:02 INFO - 'PWD': '/builds/slave/test', 04:58:02 INFO - 'SHELL': '/bin/bash', 04:58:02 INFO - 'SHLVL': '1', 04:58:02 INFO - 'TERM': 'linux', 04:58:02 INFO - 'TMOUT': '86400', 04:58:02 INFO - 'USER': 'cltbld', 04:58:02 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:58:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:58:02 INFO - '_': '/tools/buildbot/bin/python'} 04:58:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:58:02 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)) 04:58:02 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)) 04:58:02 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)) 04:58:02 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)) 04:58:02 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)) 04:58:02 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)) 04:58:02 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)) 04:58:02 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)) 04:58:02 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)) 04:58:02 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)) 04:58:02 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)) 04:58:02 INFO - Cleaning up... 04:58:02 INFO - Return code: 0 04:58:02 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:58:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:58:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:58:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:58:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:58:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:58:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:58:02 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 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:58:02 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 04:58:02 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 04:58:02 INFO - Using env: {'DISPLAY': ':0', 04:58:02 INFO - 'HOME': '/home/cltbld', 04:58:02 INFO - 'LANG': 'en_US.UTF-8', 04:58:02 INFO - 'LANGUAGE': 'en_US:en', 04:58:02 INFO - 'LOGNAME': 'cltbld', 04:58:02 INFO - 'MAIL': '/var/mail/cltbld', 04:58:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:58:02 INFO - 'MOZ_NO_REMOTE': '1', 04:58:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:58:02 INFO - 'NO_EM_RESTART': '1', 04:58:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:58:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:58:02 INFO - 'PWD': '/builds/slave/test', 04:58:02 INFO - 'SHELL': '/bin/bash', 04:58:02 INFO - 'SHLVL': '1', 04:58:02 INFO - 'TERM': 'linux', 04:58:02 INFO - 'TMOUT': '86400', 04:58:02 INFO - 'USER': 'cltbld', 04:58:02 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:58:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:58:02 INFO - '_': '/tools/buildbot/bin/python'} 04:58:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:58:02 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:58:02 INFO - Cleaning up... 04:58:02 INFO - Return code: 0 04:58:02 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 04:58:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:58:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:58:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:58:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:58:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:58:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:58:02 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 0x7f69dbec5f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc218a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcec350>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, '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': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', '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 04:58:02 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 04:58:02 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 04:58:02 INFO - Using env: {'DISPLAY': ':0', 04:58:02 INFO - 'HOME': '/home/cltbld', 04:58:02 INFO - 'LANG': 'en_US.UTF-8', 04:58:02 INFO - 'LANGUAGE': 'en_US:en', 04:58:02 INFO - 'LOGNAME': 'cltbld', 04:58:02 INFO - 'MAIL': '/var/mail/cltbld', 04:58:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:58:02 INFO - 'MOZ_NO_REMOTE': '1', 04:58:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:58:02 INFO - 'NO_EM_RESTART': '1', 04:58:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:58:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:58:02 INFO - 'PWD': '/builds/slave/test', 04:58:02 INFO - 'SHELL': '/bin/bash', 04:58:02 INFO - 'SHLVL': '1', 04:58:02 INFO - 'TERM': 'linux', 04:58:02 INFO - 'TMOUT': '86400', 04:58:02 INFO - 'USER': 'cltbld', 04:58:02 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:58:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:58:02 INFO - '_': '/tools/buildbot/bin/python'} 04:58:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:58:02 INFO - Downloading/unpacking flake8 04:58:02 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 04:58:02 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 04:58:02 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 04:58:02 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 04:58:02 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 04:58:02 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 04:58:04 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:58:04 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:58:04 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 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 04:58:04 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 04:58:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 04:58:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:58:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:58:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:58:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:58:05 INFO - no previously-included directories found matching 'docs/_build' 04:58:05 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:58:05 INFO - Running setup.py install for pep8 04:58:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:58:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:58:05 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:58:05 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:58:05 INFO - no previously-included directories found matching 'docs/_build' 04:58:05 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 04:58:05 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:58:05 INFO - Cleaning up... 04:58:05 INFO - Return code: 0 04:58:05 INFO - Running post-action listener: _resource_record_post_action 04:58:05 INFO - Running post-action listener: _start_resource_monitoring 04:58:05 INFO - Starting resource monitoring. 04:58:05 INFO - ##### 04:58:05 INFO - ##### Finished create-virtualenv step (success) 04:58:05 INFO - ##### 04:58:05 INFO - ##### 04:58:05 INFO - ##### Running install step. 04:58:05 INFO - ##### 04:58:05 INFO - Running pre-action listener: _resource_record_pre_action 04:58:05 INFO - Running main action method: install 04:58:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:58:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:58:05 INFO - Reading from file tmpfile_stdout 04:58:05 INFO - Detecting whether we're running mozinstall >=1.0... 04:58:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:58:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:58:06 INFO - Reading from file tmpfile_stdout 04:58:06 INFO - Output received: 04:58:06 INFO - Usage: mozinstall [options] installer 04:58:06 INFO - Options: 04:58:06 INFO - -h, --help show this help message and exit 04:58:06 INFO - -d DEST, --destination=DEST 04:58:06 INFO - Directory to install application into. [default: 04:58:06 INFO - "/builds/slave/test"] 04:58:06 INFO - --app=APP Application being installed. [default: firefox] 04:58:06 INFO - mkdir: /builds/slave/test/build/application 04:58:06 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'] 04:58:06 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 04:58:22 INFO - Reading from file tmpfile_stdout 04:58:22 INFO - Output received: 04:58:22 INFO - /builds/slave/test/build/application/firefox/firefox 04:58:22 INFO - Running post-action listener: _resource_record_post_action 04:58:22 INFO - ##### 04:58:22 INFO - ##### Finished install step (success) 04:58:22 INFO - ##### 04:58:22 INFO - ##### 04:58:22 INFO - ##### Running run-tests step. 04:58:22 INFO - ##### 04:58:22 INFO - Running pre-action listener: _resource_record_pre_action 04:58:22 INFO - Running main action method: run_tests 04:58:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:58:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:58:22 INFO - Python 2.7.3 04:58:22 INFO - Return code: 0 04:58:22 INFO - grabbing minidump binary from tooltool 04:58:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:58:22 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 0xd7b1c0>, '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 0xd7c0c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd7c550>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:58:22 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 04:58:22 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 04:58:22 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 04:58:22 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:58:22 INFO - Return code: 0 04:58:22 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:58:22 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:58:22 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:58:22 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:58:22 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:58:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 04:58:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 04:58:23 INFO - Return code: 0 04:58:23 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/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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 04:58:23 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/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-002 --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 04:58:23 INFO - Using env: {'DISPLAY': ':0', 04:58:23 INFO - 'HOME': '/home/cltbld', 04:58:23 INFO - 'LANG': 'en_US.UTF-8', 04:58:23 INFO - 'LANGUAGE': 'en_US:en', 04:58:23 INFO - 'LOGNAME': 'cltbld', 04:58:23 INFO - 'MAIL': '/var/mail/cltbld', 04:58:23 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:58:23 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:58:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:58:23 INFO - 'MOZ_NO_REMOTE': '1', 04:58:23 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:58:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:58:23 INFO - 'NO_EM_RESTART': '1', 04:58:23 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:58:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:58:23 INFO - 'PWD': '/builds/slave/test', 04:58:23 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:58:23 INFO - 'SHELL': '/bin/bash', 04:58:23 INFO - 'SHLVL': '1', 04:58:23 INFO - 'TERM': 'linux', 04:58:23 INFO - 'TMOUT': '86400', 04:58:23 INFO - 'USER': 'cltbld', 04:58:23 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487', 04:58:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:58:23 INFO - '_': '/tools/buildbot/bin/python'} 04:58:23 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/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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 04:58:24 INFO - mozversion application_buildid: 20160607023009 04:58:24 INFO - mozversion application_changeset: c227ee36b4844af150165c64e13347f483db8284 04:58:24 INFO - mozversion application_display_name: Nightly 04:58:24 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:58:24 INFO - mozversion application_name: Firefox 04:58:24 INFO - mozversion application_remotingname: firefox 04:58:24 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 04:58:24 INFO - mozversion application_vendor: Mozilla 04:58:24 INFO - mozversion application_version: 50.0a1 04:58:24 INFO - mozversion platform_buildid: 20160607023009 04:58:24 INFO - mozversion platform_changeset: c227ee36b4844af150165c64e13347f483db8284 04:58:24 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 04:58:24 INFO - mozversion platform_version: 50.0a1 04:58:24 INFO - using testdate: 1465300704 04:58:24 INFO - actual date: 1465300704 04:58:24 INFO - starting webserver on 'localhost:54539' 04:58:24 INFO - SUITE-START | Running 2 tests 04:58:24 INFO - TEST-START | dromaeo_css 04:58:24 INFO - operating with platform_type : linux_ 04:58:24 INFO - Initialising browser for dromaeo_css test... 04:58:24 INFO - TEST-INFO | started process 30761 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnpgl2Q/profile http://localhost:54539/getInfo.html) 04:58:28 INFO - PROCESS | 30761 | __metrics Screen width/height:1600/1200 04:58:28 INFO - PROCESS | 30761 | colorDepth:24 04:58:28 INFO - PROCESS | 30761 | Browser inner width/height: 1024/697 04:58:28 INFO - PROCESS | 30761 | __metrics 04:58:29 ERROR - PROCESS | 30761 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 04:58:29 INFO - PROCESS | 30761 | console.error: PushService: 04:58:29 INFO - PROCESS | 30761 | stateChangeProcessEnqueue: Error transitioning state 04:58:29 INFO - PROCESS | 30761 | UnknownError 04:58:29 INFO - TEST-INFO | 30761: exit 0 04:58:29 INFO - Browser initialized. 04:58:29 INFO - Running cycle 1/1 for dromaeo_css test... 04:58:30 INFO - TEST-INFO | started process 30842 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpnpgl2Q/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:58:41 INFO - PROCESS | 30842 | RSS: Main: 156356608 04:58:41 INFO - PROCESS | 30842 | 04:59:32 INFO - PROCESS | 30842 | 1465300772850 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] 05:01:40 INFO - PROCESS | 30842 | Cycle 1(1): loaded http://localhost:54539/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54539/tests/dromaeo/cssquery-ext.html) 05:01:41 INFO - PROCESS | 30842 | RSS: Main: 244449280 05:01:41 INFO - PROCESS | 30842 | 05:04:43 INFO - PROCESS | 30842 | Cycle 1(1): loaded http://localhost:54539/tests/dromaeo/cssquery-ext.html (next: http://localhost:54539/tests/dromaeo/cssquery-jquery.html) 05:04:44 INFO - PROCESS | 30842 | RSS: Main: 247406592 05:04:44 INFO - PROCESS | 30842 | 05:07:46 INFO - PROCESS | 30842 | Cycle 1(1): loaded http://localhost:54539/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54539/tests/dromaeo/cssquery-mootools.html) 05:07:47 INFO - PROCESS | 30842 | RSS: Main: 246636544 05:07:47 INFO - PROCESS | 30842 | 05:10:49 INFO - PROCESS | 30842 | Cycle 1(1): loaded http://localhost:54539/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54539/tests/dromaeo/cssquery-prototype.html) 05:10:49 INFO - PROCESS | 30842 | RSS: Main: 238129152 05:10:49 INFO - PROCESS | 30842 | 05:13:52 INFO - PROCESS | 30842 | Cycle 1(1): loaded http://localhost:54539/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54539/tests/dromaeo/cssquery-yui.html) 05:13:53 INFO - PROCESS | 30842 | RSS: Main: 235290624 05:13:53 INFO - PROCESS | 30842 | 05:16:55 INFO - PROCESS | 30842 | Cycle 1(1): loaded http://localhost:54539/tests/dromaeo/cssquery-yui.html (next: http://localhost:54539/tests/dromaeo/cssquery-dojo.html) 05:16:56 INFO - PROCESS | 30842 | RSS: Main: 320040960 05:16:56 INFO - PROCESS | 30842 | 05:16:56 INFO - PROCESS | 30842 | __start_tp_report 05:16:56 INFO - PROCESS | 30842 | _x_x_mozilla_page_load 05:16:56 INFO - PROCESS | 30842 | _x_x_mozilla_page_load_details 05:16:56 INFO - PROCESS | 30842 | |i|pagename|runs| 05:16:56 INFO - PROCESS | 30842 | |0;dojo.html;3089.78371513994;3100.1784527100335;3118.8752449902004;3142.1987393214727;3156.6685498022707;5151.356080489939;5234.895302093956;5254.553362964148;5324.307839980802;5338.519533242007;5237.816676416326;5287.524122828944;5299.28459657946;5328.307320048398;5336.146216605344;4786.425628924525;4800.615950723951;4846.757662116897;4855.708657480563;4958.454569997315;4862.8410328316395;4890.951090489085;4918.385201849769;4932.53140951609;4947.8268260610885;4718.268668356393;4732.83435079774;4752.619790416776;4788.928166077511;4852.369192005034;4706.835260765857;4724;4725.740084295362;4788.377510923558;4832.73419961902;4731.266653668687;4766.285057241407;4769.403824521934;4769.57073863354;4806.759662016885;5073.949260507421;5121.871953201163;5190.584753219733;5248.448912864133;5253.816116435944;5633.802816901389;5652.660840349592;5653.349864765563;5689.772409103631;5693.516051135658;5483.890322193573;5671.120976248688;5675.120356344773;5717.71411429431;5725.742341594639;5291.497307755757;5358.705271210082;5361.3030306060355;5440.863978400572;5442.972785136049;5895.764169433174;5903.881922361528;5912.9113063304085;5915.497182739429;5925.288965324189;5376.838694839161;5679.943200568024;5689.601727879091;5690.231818704505;5692.402297758758;5636.379998200195;5702.116171993348;5709.885802283931;5732.627379220337;5789.536837053026;5665.801696940587;5671.631343962629;5673.943260567424;5676.77292908279;5742.081266997344;5442.428545002717;5499.697516636544;5652;5708;5709.429057094258;4261.87214383569;4292.763897985641;4298.677599180074;4339.457567804025;4342.435483387139;3836.731428799957;3852.3643598806443;3860.189360234382;3881.029742564359;3895.3572660511263;5191.844244672666;5266.8419947401635;5290;5317.096093664087;5332.120200167006;5658.377578466366;5674.26234589509;5678.602497825195;5679.602427830095;5739.2252045973255;5307.071262529042;5321.840344789663;5327.680339179584;5328.227407025959;5328.573714102862;4643.349931009661;4717.363155973968;4744.1934871072;4765.070811191854;4785.832495862628;5876.7355469004;5890.204822349014;5890.293164820249;5892.528597712173;5935.703214839241;5707.600467967285;5717.514011308919;5718.571107167062;5720.941625799241;5723;5673.5461163107675;5731.627444216113;5752.71236438168;5784.334801497714;5867.73595188209;5533.170024496358;5536.972315138399;5540.889182216414;5541.2796336476;5547.528460080938;5626.971865140812;5655.519280861008;5672.631278966854;5676.602637815313;5680.517156041617;5437.966786310589;5467.9453205467435;5513.393526712139;5531.308586426697;5544.556435485232;5536.390996990408;5538.750756216061;5540.91688624679;5546.057170280981;5550.222968784293;5334.866628334323;5402.108652072364;5444.96545656324;5461.2627295316215;5512.889742205213;5455.672659640434;5473;5513.558915286687;5611.130274807411;5617.831465056055;5445.918311225256;5447.182922561489;5448.591355648421;5449.754761035683;5497 05:16:56 INFO - PROCESS | 30842 | |1;ext.html;593.4036293525006;602.9427204415579;626.6177631644697;631.1605564599083;638.3297537585534;33703.83148084262;42142.789286053565;43640.3453948191;43661.56338436623;46036.38872639458;44764.552354476444;45053;45180;45286.867828304225;45298.77350613242;8592.570371481417;8720.17158369957;8772.824543509127;8776.517291548962;8783.692570760024;8584.0557538671;8759.693410730593;8765.649374025063;8775.824483510358;8785.253253473462;8792.560371981408;8818.735437936872;8860.778480537974;8878.24534914533;8881.1118888111;8729.912700872974;8750.25622822064;8771.73684789451;8775.605097770616;8789.472631642122;8655.653773849039;8731.432456890345;8739.912600873973;8746.344024198146;8755.168259015383;41052.79473602643;41440.79279603583;41446.37830432546;41465.378019329735;41481.377779333336;3453.9138559096605;3608.6932610728118;3646.3254297954963;3873.0704630888667;4126.8761937141635;31530.842345788355;31798.205044873834;31996.360072798645;32108.518372224436;33597;3864.2271545690974;3982.38273067675;4064.2074795414906;4075.347944328923;4156.459660244149;230259;230270;230622;231303.9999999983;231950;54883.72558137264;54957.45042549523;55079;55146.72426637841;55199;57612;57819;57925.420745792006;58000;58012;14466.27668616586;14497.855021449861;14513;14592.781108283385;14761.261936903327;10824;10885.510152043176;10918.72703182411;10922;10946.069584085282;14202.431902723776;15449.691006179813;15467.149306788235;15587.610309742347;15651.452199172974;5432.809851655173;6181.165542651775;6533.314002029813;6567.211934567787;6571.178602674666;1019.954102065394;1029.2846471702244;1065.3820783945448;1168.2172944127456;1168.9006434453167;31484.527732084036;31997.8400107998;32035.839820800746;32273.677263227535;32967;1102.9172812039128;1135.6365962891796;1157.2542327344775;1238.2570457725292;1256.108163204117;16782.83217167813;16866.241019153924;16875.57811054709;16884.57788555296;16911.577210569587;567660;572831;574468;575442;576497;56139.71930140323;58111;58185;58251.12623310654;58299;1277.8594354620984;1294.1652634050984;1308.738252349534;1398.0912406935574;1401.4884567132924;27045.86477067602;32165.839170803996;32369.838150809097;32905.17737056497;33778.49332259969;48012;48032;48388;48454;48479.84880982725;426498;429836;432023;433995;434648;38657.42013869851;38915.61084389233;40218;40380.798096009334;40469.59530404658;45765.31352029656;46647.76676116598;46703.766481167375;47358.76320618375;47918.76040619775;40346.97243695424;40887.1822563553;41305.793471032455;41358.1728365437;42124.15751685011;39622.40566391564;40018.39972400358;40486.79756601316;40844.387334189414;41630.58369416267;40468.392974106;41419.378709319986;41572.3764143532;41624.3756343649;41796.3730544036;34471;35999.820000899825;36689.44965825568;37213.25573488461;37410.8129459351;27189.59215611807;27586.448271034868;27852.72147278501;27897.860510697315;27989 05:16:56 INFO - PROCESS | 30842 | |2;jquery.html;387.27965983271093;389.6571017504596;397.4296883971503;406.70107471008805;406.94913135858013;14143.434262629482;16556.50330490087;18097.638047239063;19589.412317630475;19629.11668974896;14496.20270885101;16752;17760.378386756467;18102.728459073125;18190.545236369097;5497.697626630534;5499.7250137493165;5590.944090559104;5595.272614560122;5689.6017278790505;4010.077682133111;5531.917021244684;5614.66312021278;5655.4910058094765;5865.9413405866035;6201.875962480748;6285.622862628234;6305.621662700252;6313.273973493061;6317.463015643676;6147.10866924298;6258.436740693337;6301.936980630181;6357.777477788301;6362.427381535661;5563.554915606782;5566.666000040011;5568.331800183963;5573.498385145316;5574.916376254359;20730;21835.890820545796;22019.66970495444;22290.554188916132;22305.219317323816;2462.5936720441287;2516.2828593850663;2529.2285852814884;2567.165671156863;2574.382148284417;13048.217106973612;13237.86762132376;13635.795463068062;13813.102148360324;14032.859671403257;1897.601503684214;1948.1915005272795;1985.2158397433077;2011.6680747676617;2019.151956178394;70823;76711.23288767097;78738;79115;79247.6037619814;9546.90453095474;10258.692239232834;11056.834147487794;11080;11227.27022743519;15181.62045948838;15296.694066118615;15304.923475382775;15316.923415382851;15323;6917.9654101730175;7126.180489243699;7393.852122957511;7612.3148916597775;7715.729949451742;6925.896111558331;6953.235144134142;7138.8220943544775;7260.600666963368;7384.409247260206;4377.759223242752;4449.866504004885;4637.466691330473;4786.64100192487;4803.807847686124;1958.4614231086566;1959.5101224693826;1964.5776158125786;1989.890715841213;1992.6413245615638;898.501331760879;983.3165949664914;1012.422918936214;1057.830747080479;1090.8145615245269;18397.172127254307;18740.437786866416;18991.90504047471;19000.334988275343;19200.903995479934;973.6932866147141;980.8185485685171;1032.3083534032216;1071.0146665068155;1075.070064394309;10279.280450368551;10615.68152955397;10624.893751062546;10634.680959571226;10644;435621;451312.97374052333;464982;465132;465294;94828.52585737027;95292.52353738187;95322.52338738262;96901;98489;982.749398903275;1007.1288335589662;1007.9848802267971;1019.4036488654073;1031.783325501638;16388.672226555165;16571.751423728896;16600.169991500617;16747.33010679559;16838.747418788975;40397.59602404056;40415.191696165326;41000.58999410087;42119;43306;40441.79779101086;48963.26555101605;50371.74814126053;55090.72454637701;58667;7673.61631918413;7886.526808391515;8040.115587285511;8224.958875205824;8307.501549907025;8975.640974361213;10964.780704386027;12848.743025139258;12870.806937896126;13243.271620060988;11853.881461185278;11905.107116966436;11961.880381196424;11989.580364687194;12089;11621.24461909973;11737.706557335794;11760.70598235051;11786.292822430682;11952;10912.672619821418;11609.419529023684;11616;11708.536432945883;12039.699007524532;8233.629486672995;8243.299319557906;8319.958400207961;8352.41533092702;8401.70594029206;8507.319414446953;10742.73143171427;11911.3448760319;11930.403479826147;12120.878791211975 05:16:56 INFO - PROCESS | 30842 | |3;mootools.html;1389.2914613547089;1481.214956073281;1531.3338697666516;1676.6143786929006;1850.5188650950756;8440.282575981042;8793.736187914374;8804.955975220131;8807;8810.999999999993;8541.871871921927;8722.563871806417;8734.257588105003;8738.169873861973;8760.605772740226;2002.2791794953805;2074.1392322186275;2197.560487902414;2232.352617740861;2253.4591697992446;2321.8490798098155;2347.94130146746;2349.89425475854;2350.682657841195;2350.788429041386;2293.6674182243564;2305.7348404933477;2320.269115228706;2323.2797832671927;2326.3718795925092;1947.4839167620662;2168.230278251214;2246.2587346175724;2288.8168946484243;2321.663358812971;2255.9661605075935;2291.724993000834;2292.358139720864;2294.357579877637;2295.368773587277;8646.610902509403;8761.299096072362;8762.561871906379;8766.474011559263;8768.210861022475;5053.823116190915;5188.740562971836;5194.948050519484;5195.792168313263;5197.948020519784;3192.728618067467;3221.500667396534;3383.881564145243;3389.3390788796196;3395.5246265522846;1162.2851946053202;1163.1741463560882;2083.8851214600118;2141.871487710727;2186.5954798362354;11700.765984680258;11761.353125578089;11766.058715302755;11778.587749428814;11780.352080635561;4202.663786897041;4265.317549192177;4273.722208056529;4347.847825326162;4348.565143485626;9274;9375.765605859908;9383.812323753487;9384.8592271116;9417.340786144903;4939.975300123477;4946.356973593482;4946.604271658259;4948.8762780930765;4952.182889823139;4266.189424009428;4626.1441633297945;4626.791794369262;4715.316279139505;4732.692374995614;3642.5993140754495;3649.251903359805;3732.8320225589914;3792.412176112707;3804.923901521954;1097.6981330134277;1125.2292179856825;1129.5594718059963;1146.1289420040662;1153.140910022039;867.3104881619001;960.524540352516;968.0899954043177;992.2905122837207;1000.8748906386702;5802.912956305659;5839.474447299764;5841.707914604338;5941;5954.55340849438;413.50586049670954;419.1637682822727;423.14102372184516;425.402309754795;427.24164607821365;4140.109876376593;4155.937660935088;4156.168766246763;4169;4186.58134186585;10262.897371026344;10657.360558366523;10670.57317707283;10686.358818470917;10699.732506687395;10563.102136318344;10567.365958042543;10569.260151789455;10571.788564228673;10586.788264234672;7759;8012.919870801217;8050.436469447082;8050.4767190133625;8057.395695322874;5836.591438599427;5872.882542349043;6001.279846418458;6067;6214.316425193316;9484.430934143973;9831.459269740233;9894.158996485092;9958.15355694745;10032.347897386646;9981.550830212513;10148.13740832008;10168.796624067625;10240;10300.536475858455;6893.689783959633;7446.404287657083;7548.131964824115;7683.154852966281;7990;8642.654293828176;8645.135486451556;8683;8727.56362181901;8750;7546.24537546241;7597.6201189939175;7629.427792915442;7740.574268415066;7924.247196516321;7527.661255243636;7543.321101100927;7652.234776522526;7766.068071831416;7782.649780759993;6965.373116419547;7034.331738484836;7038.894416583653;7040.436765058886;7055.047568578177;5029.29589857413;5092.465291144525;5190.299309593157;5202.505761952609;5310.601704872072;5202.765875535686;5298.1258092415865;5303.4431384705595;5348.331458567679;5357.598180136583 05:16:56 INFO - PROCESS | 30842 | |4;prototype.html;318.15688425671965;324.4468181750116;331.65839185638794;332.21265600526755;332.53113110514164;5318.813841515548;5333.733313334337;5364.678119312844;5381.5963802714805;5387.545362752055;5266.34170728659;5279.41926388098;5286.259923610688;5313.442088580691;5339.305890234274;3777.8677746278886;3963.365861462167;4089.018635527482;4114.711970162075;4115.691323150761;4140.730852494578;4144;4144.274751918418;4162.666986641077;4192.7693976831415;4060.20825938942;4062.7765472898977;4064;4103.425520427142;4125.649319807805;3918.7060970427333;3939.5075615548058;4070.715049946505;4138.937915931264;4140.109876376563;3545.468179773029;3552.7513074084823;3564.215872508044;3566.375884220251;3567.1438854674952;5053.671511351788;5077.441481437039;5093.592512598983;5150.304708864331;5172.27588137661;4491.303847903548;4688.882777930545;4702.6002789762915;4727.243641017455;4728.196206644879;5534.557235421156;5537.695426751527;5547.223388725582;5555.30558680165;5566.66600003997;3990.2418540477215;3990.5809889961424;4015.6385925266572;4018.5177778666457;4024.094578719794;5651.802186923438;5674.744636491368;5702.65784052954;5843.298804143487;5862.237909071836;4089.875284296842;4116.279651061052;4121.5466298707115;4127.772972486542;4134.37984302351;4156.713807405915;4171.416001759756;4176.477940257468;4180.770057646859;4187.309093999456;4543;4737.313089601988;4743.83396581118;4762.238041913347;4772.260299653559;5546.251256080458;5548.223248745179;5552.611317207757;5562.193481945095;5562.415946325577;1432.777919422491;1436.7198396312829;1443.6968236670207;1462.393106860662;1466.5013895275658;902.4720538484928;909.8180363927241;919.1222382624577;941.0354386753633;965.5944503308486;4714.669973101919;4725.881852953704;4775.761211939459;4799.568038876518;4837.346958160603;5074.517920797518;5076.99458713806;5087.949120508822;5113.028524580318;5141.38303403594;4498.437695288089;4635.536446355338;4705.882352941136;4813.9037219256115;4816.301636262722;2693.501702185102;2695.4339588686594;2705.418335057972;2708.510319324403;2716.714744951791;5218.6868787872845;5224.190250511177;5231.607629427732;5238.895222095537;5284.260203571503;4861.295112208781;5136.717480538607;5151.141116680278;5180.663256888365;5495.505404513613;5749.482546570829;5848.883022339614;5883.14694369314;5933.406659334032;5957.880842383215;5727.8568035799435;5728.684922329312;5731.770729170787;5736.971315143398;5740.253767010262;5385;5660.632058916157;5662.8301150965535;5671.313646129884;5701.945140149086;5899;5908.704564771659;5911.078899357812;5924.4667979882015;5939.10913362999;4157.064660451374;4191.371294305878;4202.705810593351;4216.599423054805;4217.536071032123;5517.889642207053;5660.7169641518585;5689.260396148474;5701.600887937804;5759.856003599776;5535.225068490334;5538.335399752055;5575.832725018256;5629.78959523688;5637.661740295432;5353.678779273256;5590.44095590454;5592.636478628876;5613.775448982158;5637.802676906289;5460.31746031746;5505.201745746765;5506.559475241891;5514.228008078792;5540.75066622011;5615.887682246251;5634.873025394855;5640.576956728344;5642.463965923231;5643.52030077448;5299.099153144052;5403.216533602685;5433.320834895638;5460.890782184255;5522.950639378505 05:16:56 INFO - PROCESS | 30842 | |5;yui.html;718.0547244736985;797.0767260518497;820.9630566624503;831.4803247970019;833.8874251975982;14686.41254349826;14780.334884930176;15367.462138825116;15477.38090476381;15490.845091549081;14804.40782368704;14962.25188740564;14980.25098745061;14984.550463486086;14984.550463486086;813.1461964936808;819.5615345790004;823.0987069159261;825.3644693585935;825.781167990483;658.6410406328539;778.1984555907425;795.2842441802367;821.7699044267615;826.6982551368737;799.4124318625805;800.6917336825306;803.1406395157184;804.8873157757919;806.3267171911461;682.1405029662611;829.3613917283687;830.9127541608135;832.1803024021365;835.1439774231401;587.6591576885396;615.5783288447428;621.5183232994466;621.6705146272483;622.5766478794418;14762.630934226623;14994.175320357375;15006.474773382879;15011.099334039993;15026.849731502654;14230.075045122137;14711.485098021518;14813.925930370388;14890.404383824634;15094.16982065986;13195.340232988312;13242.66893327665;13244.735105297936;13426.731465370736;13870.861291387158;4460.30865215892;4494.303382975611;4625.306204069417;4689.226277664216;4714.339992401066;73181.6340918292;74259.62870185668;75949.99999999945;76437.61781191059;77096.61451692706;11827.881721182677;11879.22785018971;11914.940425297818;11946.283223006647;11950.462229199708;21973.23093691713;22033.118675253132;22061.227857024925;22082.33752987413;22162.33512994613;8471.217725069793;8554.61504232311;8574;8584.098669639723;8722.86915696265;4718.150732868048;4828.975855120702;4841.419029716457;4841.733704646208;4882.8779280517565;3344.9832750836576;3441.5181874537584;3443.5867695876154;3444.3111377724554;3445.5176275321473;598.7215944585702;607.2439812433548;608.2822269721682;610.2036841921336;615.8460384903774;664.4451882678018;703.2369878681585;715.53490231349;715.5527795128045;716.6345163966415;10104.141148002502;10147.695569132939;10190.541425635864;10206.234532410099;10208.948955255177;636.6530241018656;646.7380710812129;700.7827573452246;702.6170736948376;722.663961258007;4476.731396116244;4622.699524530894;4623.583877451046;4656.604188643935;4737.526247375235;66160;87932;108556.45721771341;114893.4255328718;115646;97855;98378.50810746044;100129.49935250277;101192;101519;88218;90175;90178.54910725536;90320.54839725759;90796.09203908009;8162.632681529464;8442.831143377221;8647.221750042527;8709.651613935624;8970.820583588422;46718;47872.281915771986;50120.74939625424;50174.70857017716;50896.49103508917;71941.6402917982;74788.62605686937;74923.62538187274;75063.24936750563;77128.2287177121;11505.597304094317;11515.769684606428;11770.82343764827;11804.704882377666;12133.272003679807;12516.812247816108;12743.808842867178;12996.090273680751;13008.349582521025;13333.066685331934;12344.62966111018;12447.190932589352;12474.251544907334;12498.687532811753;12510.712074303405;12115.697107572381;12531.624051278477;12652.493900243888;12855.87144128584;13293.601191964257;12411.17293988358;12738.363081846055;12820.038497112568;13111.409986550438;13191.40638671243;9948.751281218027;10145.87437348815;10263.486825658836;10363.430011349448;10395.116415104498;9563.952180239054;9704.272179586418;10355.223358248011;10411.94794026025;10464.47677616101 05:16:56 INFO - PROCESS | 30842 | __end_tp_report 05:16:56 INFO - PROCESS | 30842 | __start_cc_report 05:16:56 INFO - PROCESS | 30842 | _x_x_mozilla_cycle_collect,846 05:16:56 INFO - PROCESS | 30842 | __end_cc_report 05:16:56 INFO - PROCESS | 30842 | __startTimestamp1465301816112__endTimestamp 05:16:56 INFO - PROCESS | 30842 | 05:16:56 INFO - PROCESS | 30842 | ------- Summary: start ------- 05:16:56 INFO - PROCESS | 30842 | Number of tests: 6 05:16:56 INFO - PROCESS | 30842 | 05:16:56 INFO - PROCESS | 30842 | [#0] dojo.html Cycles:165 Average:5254.05 Median:5447.18 stddev:599.71 (11.0%) stddev-sans-first:577.02 05:16:56 INFO - PROCESS | 30842 | Values: 3089.8 3100.2 3118.9 3142.2 3156.7 5151.4 5234.9 5254.6 5324.3 5338.5 5237.8 5287.5 5299.3 5328.3 5336.1 4786.4 4800.6 4846.8 4855.7 4958.5 4862.8 4891.0 4918.4 4932.5 4947.8 4718.3 4732.8 4752.6 4788.9 4852.4 4706.8 4724.0 4725.7 4788.4 4832.7 4731.3 4766.3 4769.4 4769.6 4806.8 5073.9 5121.9 5190.6 5248.4 5253.8 5633.8 5652.7 5653.3 5689.8 5693.5 5483.9 5671.1 5675.1 5717.7 5725.7 5291.5 5358.7 5361.3 5440.9 5443.0 5895.8 5903.9 5912.9 5915.5 5925.3 5376.8 5679.9 5689.6 5690.2 5692.4 5636.4 5702.1 5709.9 5732.6 5789.5 5665.8 5671.6 5673.9 5676.8 5742.1 5442.4 5499.7 5652.0 5708.0 5709.4 4261.9 4292.8 4298.7 4339.5 4342.4 3836.7 3852.4 3860.2 3881.0 3895.4 5191.8 5266.8 5290.0 5317.1 5332.1 5658.4 5674.3 5678.6 5679.6 5739.2 5307.1 5321.8 5327.7 5328.2 5328.6 4643.3 4717.4 4744.2 4765.1 4785.8 5876.7 5890.2 5890.3 5892.5 5935.7 5707.6 5717.5 5718.6 5720.9 5723.0 5673.5 5731.6 5752.7 5784.3 5867.7 5533.2 5537.0 5540.9 5541.3 5547.5 5627.0 5655.5 5672.6 5676.6 5680.5 5438.0 5467.9 5513.4 5531.3 5544.6 5536.4 5538.8 5540.9 5546.1 5550.2 5334.9 5402.1 5445.0 5461.3 5512.9 5455.7 5473.0 5513.6 5611.1 5617.8 5445.9 5447.2 5448.6 5449.8 5497.0 05:16:56 INFO - PROCESS | 30842 | 05:16:56 INFO - PROCESS | 30842 | [#1] ext.html Cycles:180 Average:57567.18 Median:41430.09 stddev:116004.99 (280.0%) stddev-sans-first:116251.55 05:16:56 INFO - PROCESS | 30842 | Values: 593.4 602.9 626.6 631.2 638.3 33703.8 42142.8 43640.3 43661.6 46036.4 44764.6 45053.0 45180.0 45286.9 45298.8 8592.6 8720.2 8772.8 8776.5 8783.7 8584.1 8759.7 8765.6 8775.8 8785.3 8792.6 8818.7 8860.8 8878.2 8881.1 8729.9 8750.3 8771.7 8775.6 8789.5 8655.7 8731.4 8739.9 8746.3 8755.2 41052.8 41440.8 41446.4 41465.4 41481.4 3453.9 3608.7 3646.3 3873.1 4126.9 31530.8 31798.2 31996.4 32108.5 33597.0 3864.2 3982.4 4064.2 4075.3 4156.5 230259.0 230270.0 230622.0 231304.0 231950.0 54883.7 54957.5 55079.0 55146.7 55199.0 57612.0 57819.0 57925.4 58000.0 58012.0 14466.3 14497.9 14513.0 14592.8 14761.3 10824.0 10885.5 10918.7 10922.0 10946.1 14202.4 15449.7 15467.1 15587.6 15651.5 5432.8 6181.2 6533.3 6567.2 6571.2 1020.0 1029.3 1065.4 1168.2 1168.9 31484.5 31997.8 32035.8 32273.7 32967.0 1102.9 1135.6 1157.3 1238.3 1256.1 16782.8 16866.2 16875.6 16884.6 16911.6 567660.0 572831.0 574468.0 575442.0 576497.0 56139.7 58111.0 58185.0 58251.1 58299.0 1277.9 1294.2 1308.7 1398.1 1401.5 27045.9 32165.8 32369.8 32905.2 33778.5 48012.0 48032.0 48388.0 48454.0 48479.8 426498.0 429836.0 432023.0 433995.0 434648.0 38657.4 38915.6 40218.0 40380.8 40469.6 45765.3 46647.8 46703.8 47358.8 47918.8 40347.0 40887.2 41305.8 41358.2 42124.2 39622.4 40018.4 40486.8 40844.4 41630.6 40468.4 41419.4 41572.4 41624.4 41796.4 34471.0 35999.8 36689.4 37213.3 37410.8 27189.6 27586.4 27852.7 27897.9 27989.0 05:16:56 INFO - PROCESS | 30842 | 05:16:56 INFO - PROCESS | 30842 | [#2] jquery.html Cycles:180 Average:27674.37 Median:2570.77 stddev:75473.07 (2935.8%) stddev-sans-first:75656.98 05:16:56 INFO - PROCESS | 30842 | Values: 387.3 389.7 397.4 406.7 406.9 14143.4 16556.5 18097.6 19589.4 19629.1 14496.2 16752.0 17760.4 18102.7 18190.5 5497.7 5499.7 5590.9 5595.3 5689.6 4010.1 5531.9 5614.7 5655.5 5865.9 6201.9 6285.6 6305.6 6313.3 6317.5 6147.1 6258.4 6301.9 6357.8 6362.4 5563.6 5566.7 5568.3 5573.5 5574.9 20730.0 21835.9 22019.7 22290.6 22305.2 2462.6 2516.3 2529.2 2567.2 2574.4 13048.2 13237.9 13635.8 13813.1 14032.9 1897.6 1948.2 1985.2 2011.7 2019.2 70823.0 76711.2 78738.0 79115.0 79247.6 9546.9 10258.7 11056.8 11080.0 11227.3 15181.6 15296.7 15304.9 15316.9 15323.0 6918.0 7126.2 7393.9 7612.3 7715.7 6925.9 6953.2 7138.8 7260.6 7384.4 4377.8 4449.9 4637.5 4786.6 4803.8 1958.5 1959.5 1964.6 1989.9 1992.6 898.5 983.3 1012.4 1057.8 1090.8 18397.2 18740.4 18991.9 19000.3 19200.9 973.7 980.8 1032.3 1071.0 1075.1 10279.3 10615.7 10624.9 10634.7 10644.0 435621.0 451313.0 464982.0 465132.0 465294.0 94828.5 95292.5 95322.5 96901.0 98489.0 982.7 1007.1 1008.0 1019.4 1031.8 16388.7 16571.8 16600.2 16747.3 16838.7 40397.6 40415.2 41000.6 42119.0 43306.0 40441.8 48963.3 50371.7 55090.7 58667.0 7673.6 7886.5 8040.1 8225.0 8307.5 8975.6 10964.8 12848.7 12870.8 13243.3 11853.9 11905.1 11961.9 11989.6 12089.0 11621.2 11737.7 11760.7 11786.3 11952.0 10912.7 11609.4 11616.0 11708.5 12039.7 8233.6 8243.3 8320.0 8352.4 8401.7 8507.3 10742.7 11911.3 11930.4 12120.9 05:16:56 INFO - PROCESS | 30842 | 05:16:56 INFO - PROCESS | 30842 | [#3] mootools.html Cycles:180 Average:5686.11 Median:4836.33 stddev:3213.20 (66.4%) stddev-sans-first:3205.99 05:16:56 INFO - PROCESS | 30842 | Values: 1389.3 1481.2 1531.3 1676.6 1850.5 8440.3 8793.7 8805.0 8807.0 8811.0 8541.9 8722.6 8734.3 8738.2 8760.6 2002.3 2074.1 2197.6 2232.4 2253.5 2321.8 2347.9 2349.9 2350.7 2350.8 2293.7 2305.7 2320.3 2323.3 2326.4 1947.5 2168.2 2246.3 2288.8 2321.7 2256.0 2291.7 2292.4 2294.4 2295.4 8646.6 8761.3 8762.6 8766.5 8768.2 5053.8 5188.7 5194.9 5195.8 5197.9 3192.7 3221.5 3383.9 3389.3 3395.5 1162.3 1163.2 2083.9 2141.9 2186.6 11700.8 11761.4 11766.1 11778.6 11780.4 4202.7 4265.3 4273.7 4347.8 4348.6 9274.0 9375.8 9383.8 9384.9 9417.3 4940.0 4946.4 4946.6 4948.9 4952.2 4266.2 4626.1 4626.8 4715.3 4732.7 3642.6 3649.3 3732.8 3792.4 3804.9 1097.7 1125.2 1129.6 1146.1 1153.1 867.3 960.5 968.1 992.3 1000.9 5802.9 5839.5 5841.7 5941.0 5954.6 413.5 419.2 423.1 425.4 427.2 4140.1 4155.9 4156.2 4169.0 4186.6 10262.9 10657.4 10670.6 10686.4 10699.7 10563.1 10567.4 10569.3 10571.8 10586.8 7759.0 8012.9 8050.4 8050.5 8057.4 5836.6 5872.9 6001.3 6067.0 6214.3 9484.4 9831.5 9894.2 9958.2 10032.3 9981.6 10148.1 10168.8 10240.0 10300.5 6893.7 7446.4 7548.1 7683.2 7990.0 8642.7 8645.1 8683.0 8727.6 8750.0 7546.2 7597.6 7629.4 7740.6 7924.2 7527.7 7543.3 7652.2 7766.1 7782.6 6965.4 7034.3 7038.9 7040.4 7055.0 5029.3 5092.5 5190.3 5202.5 5310.6 5202.8 5298.1 5303.4 5348.3 5357.6 05:16:56 INFO - PROCESS | 30842 | 05:16:56 INFO - PROCESS | 30842 | [#4] prototype.html Cycles:180 Average:4589.75 Median:5150.72 stddev:1350.49 (26.2%) stddev-sans-first:1315.67 05:16:56 INFO - PROCESS | 30842 | Values: 318.2 324.4 331.7 332.2 332.5 5318.8 5333.7 5364.7 5381.6 5387.5 5266.3 5279.4 5286.3 5313.4 5339.3 3777.9 3963.4 4089.0 4114.7 4115.7 4140.7 4144.0 4144.3 4162.7 4192.8 4060.2 4062.8 4064.0 4103.4 4125.6 3918.7 3939.5 4070.7 4138.9 4140.1 3545.5 3552.8 3564.2 3566.4 3567.1 5053.7 5077.4 5093.6 5150.3 5172.3 4491.3 4688.9 4702.6 4727.2 4728.2 5534.6 5537.7 5547.2 5555.3 5566.7 3990.2 3990.6 4015.6 4018.5 4024.1 5651.8 5674.7 5702.7 5843.3 5862.2 4089.9 4116.3 4121.5 4127.8 4134.4 4156.7 4171.4 4176.5 4180.8 4187.3 4543.0 4737.3 4743.8 4762.2 4772.3 5546.3 5548.2 5552.6 5562.2 5562.4 1432.8 1436.7 1443.7 1462.4 1466.5 902.5 909.8 919.1 941.0 965.6 4714.7 4725.9 4775.8 4799.6 4837.3 5074.5 5077.0 5087.9 5113.0 5141.4 4498.4 4635.5 4705.9 4813.9 4816.3 2693.5 2695.4 2705.4 2708.5 2716.7 5218.7 5224.2 5231.6 5238.9 5284.3 4861.3 5136.7 5151.1 5180.7 5495.5 5749.5 5848.9 5883.1 5933.4 5957.9 5727.9 5728.7 5731.8 5737.0 5740.3 5385.0 5660.6 5662.8 5671.3 5701.9 5899.0 5908.7 5911.1 5924.5 5939.1 4157.1 4191.4 4202.7 4216.6 4217.5 5517.9 5660.7 5689.3 5701.6 5759.9 5535.2 5538.3 5575.8 5629.8 5637.7 5353.7 5590.4 5592.6 5613.8 5637.8 5460.3 5505.2 5506.6 5514.2 5540.8 5615.9 5634.9 5640.6 5642.5 5643.5 5299.1 5403.2 5433.3 5460.9 5523.0 05:16:56 INFO - PROCESS | 30842 | 05:16:56 INFO - PROCESS | 30842 | [#5] yui.html Cycles:180 Average:20257.75 Median:25703.61 stddev:28996.81 (112.8%) stddev-sans-first:29041.04 05:16:56 INFO - PROCESS | 30842 | Values: 718.1 797.1 821.0 831.5 833.9 14686.4 14780.3 15367.5 15477.4 15490.8 14804.4 14962.3 14980.3 14984.6 14984.6 813.1 819.6 823.1 825.4 825.8 658.6 778.2 795.3 821.8 826.7 799.4 800.7 803.1 804.9 806.3 682.1 829.4 830.9 832.2 835.1 587.7 615.6 621.5 621.7 622.6 14762.6 14994.2 15006.5 15011.1 15026.8 14230.1 14711.5 14813.9 14890.4 15094.2 13195.3 13242.7 13244.7 13426.7 13870.9 4460.3 4494.3 4625.3 4689.2 4714.3 73181.6 74259.6 75950.0 76437.6 77096.6 11827.9 11879.2 11914.9 11946.3 11950.5 21973.2 22033.1 22061.2 22082.3 22162.3 8471.2 8554.6 8574.0 8584.1 8722.9 4718.2 4829.0 4841.4 4841.7 4882.9 3345.0 3441.5 3443.6 3444.3 3445.5 598.7 607.2 608.3 610.2 615.8 664.4 703.2 715.5 715.6 716.6 10104.1 10147.7 10190.5 10206.2 10208.9 636.7 646.7 700.8 702.6 722.7 4476.7 4622.7 4623.6 4656.6 4737.5 66160.0 87932.0 108556.5 114893.4 115646.0 97855.0 98378.5 100129.5 101192.0 101519.0 88218.0 90175.0 90178.5 90320.5 90796.1 8162.6 8442.8 8647.2 8709.7 8970.8 46718.0 47872.3 50120.7 50174.7 50896.5 71941.6 74788.6 74923.6 75063.2 77128.2 11505.6 11515.8 11770.8 11804.7 12133.3 12516.8 12743.8 12996.1 13008.3 13333.1 12344.6 12447.2 12474.3 12498.7 12510.7 12115.7 12531.6 12652.5 12855.9 13293.6 12411.2 12738.4 12820.0 13111.4 13191.4 9948.8 10145.9 10263.5 10363.4 10395.1 9564.0 9704.3 10355.2 10411.9 10464.5 05:16:56 INFO - PROCESS | 30842 | -------- Summary: end -------- 05:16:56 INFO - PROCESS | 30842 | 05:16:56 INFO - TEST-INFO | 30842: exit 0 05:16:56 INFO - TEST-OK | dromaeo_css | took 1112633ms 05:16:56 INFO - TEST-START | kraken 05:16:56 INFO - operating with platform_type : linux_ 05:16:56 INFO - Initialising browser for kraken test... 05:16:56 INFO - TEST-INFO | started process 31026 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpvTPxvx/profile http://localhost:54539/getInfo.html) 05:17:00 INFO - PROCESS | 31026 | __metrics Screen width/height:1600/1200 05:17:00 INFO - PROCESS | 31026 | colorDepth:24 05:17:00 INFO - PROCESS | 31026 | Browser inner width/height: 1024/697 05:17:00 INFO - PROCESS | 31026 | __metrics 05:17:01 ERROR - PROCESS | 31026 | JavaScript error: resource://app/modules/AboutNewTab.jsm, line 36: TypeError: this.pageListener is null 05:17:01 INFO - PROCESS | 31026 | console.error: PushService: 05:17:01 INFO - PROCESS | 31026 | stateChangeProcessEnqueue: Error transitioning state 05:17:01 INFO - PROCESS | 31026 | UnknownError 05:17:02 INFO - TEST-INFO | 31026: exit 0 05:17:02 INFO - Browser initialized. 05:17:02 INFO - Running cycle 1/1 for kraken test... 05:17:02 INFO - TEST-INFO | started process 31111 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpvTPxvx/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:17:14 INFO - PROCESS | 31111 | RSS: Main: 156819456 05:17:14 INFO - PROCESS | 31111 | 05:17:16 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54539/tests/kraken/driver.html?testName=audio-beat-detection) 05:17:17 INFO - PROCESS | 31111 | RSS: Main: 214970368 05:17:17 INFO - PROCESS | 31111 | 05:17:20 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54539/tests/kraken/driver.html?testName=audio-dft) 05:17:20 INFO - PROCESS | 31111 | RSS: Main: 201584640 05:17:20 INFO - PROCESS | 31111 | 05:17:24 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54539/tests/kraken/driver.html?testName=audio-fft) 05:17:24 INFO - PROCESS | 31111 | RSS: Main: 268988416 05:17:24 INFO - PROCESS | 31111 | 05:17:26 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54539/tests/kraken/driver.html?testName=audio-oscillator) 05:17:27 INFO - PROCESS | 31111 | RSS: Main: 179605504 05:17:27 INFO - PROCESS | 31111 | 05:17:29 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54539/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:17:30 INFO - PROCESS | 31111 | RSS: Main: 183562240 05:17:30 INFO - PROCESS | 31111 | 05:17:33 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54539/tests/kraken/driver.html?testName=imaging-darkroom) 05:17:33 INFO - PROCESS | 31111 | RSS: Main: 219598848 05:17:33 INFO - PROCESS | 31111 | 05:17:37 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54539/tests/kraken/driver.html?testName=imaging-desaturate) 05:17:37 INFO - PROCESS | 31111 | RSS: Main: 221343744 05:17:37 INFO - PROCESS | 31111 | 05:17:40 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54539/tests/kraken/driver.html?testName=json-parse-financial) 05:17:41 INFO - PROCESS | 31111 | RSS: Main: 220450816 05:17:41 INFO - PROCESS | 31111 | 05:17:42 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54539/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:17:43 INFO - PROCESS | 31111 | RSS: Main: 206950400 05:17:43 INFO - PROCESS | 31111 | 05:17:45 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54539/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:17:45 INFO - PROCESS | 31111 | RSS: Main: 210862080 05:17:45 INFO - PROCESS | 31111 | 05:17:47 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54539/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:17:48 INFO - PROCESS | 31111 | RSS: Main: 220393472 05:17:48 INFO - PROCESS | 31111 | 05:17:50 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54539/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:17:51 INFO - PROCESS | 31111 | RSS: Main: 223539200 05:17:51 INFO - PROCESS | 31111 | 05:17:54 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54539/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:17:54 INFO - PROCESS | 31111 | RSS: Main: 223342592 05:17:54 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | Cycle 1(1): loaded http://localhost:54539/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54539/tests/kraken/driver.html?testName=ai-astar) 05:17:56 INFO - PROCESS | 31111 | RSS: Main: 265945088 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | __start_tp_report 05:17:56 INFO - PROCESS | 31111 | _x_x_mozilla_page_load 05:17:56 INFO - PROCESS | 31111 | _x_x_mozilla_page_load_details 05:17:56 INFO - PROCESS | 31111 | |i|pagename|runs| 05:17:56 INFO - PROCESS | 31111 | |0;ai-astar;109;105;109;108;110;109;109;111;111;111 05:17:56 INFO - PROCESS | 31111 | |1;audio-beat-detection;154;125;129;186;124;158;153;130;185;136 05:17:56 INFO - PROCESS | 31111 | |2;audio-dft;161;161;161;162;160;162;163;160;162;162 05:17:56 INFO - PROCESS | 31111 | |3;audio-fft;75;74;74;127;75;76;75;75;100;74 05:17:56 INFO - PROCESS | 31111 | |4;audio-oscillator;84;85;121;85;85;87;121;85;85;133 05:17:56 INFO - PROCESS | 31111 | |5;imaging-gaussian-blur;116;116;116;116;116;116;116;117;117;116 05:17:56 INFO - PROCESS | 31111 | |6;imaging-darkroom;146;146;148;146;147;145;148;147;146;145 05:17:56 INFO - PROCESS | 31111 | |7;imaging-desaturate;94;95;96;95;94;95;96;95;95;95 05:17:56 INFO - PROCESS | 31111 | |8;json-parse-financial;51;52;54;53;52;54;54;53;52;54 05:17:56 INFO - PROCESS | 31111 | |9;json-stringify-tinderbox;61;62;62;62;62;61;62;62;63;62 05:17:56 INFO - PROCESS | 31111 | |10;stanford-crypto-aes;79;86;79;81;81;80;81;82;132;81 05:17:56 INFO - PROCESS | 31111 | |11;stanford-crypto-ccm;125;123;140;120;120;123;119;120;137;133 05:17:56 INFO - PROCESS | 31111 | |12;stanford-crypto-pbkdf2;167;162;162;166;164;163;165;164;162;162 05:17:56 INFO - PROCESS | 31111 | |13;stanford-crypto-sha256-iterative;67;70;66;64;65;68;64;62;63;61 05:17:56 INFO - PROCESS | 31111 | __end_tp_report 05:17:56 INFO - PROCESS | 31111 | __start_cc_report 05:17:56 INFO - PROCESS | 31111 | _x_x_mozilla_cycle_collect,1652 05:17:56 INFO - PROCESS | 31111 | __end_cc_report 05:17:56 INFO - PROCESS | 31111 | __startTimestamp1465301876799__endTimestamp 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | ------- Summary: start ------- 05:17:56 INFO - PROCESS | 31111 | Number of tests: 14 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#0] ai-astar Cycles:10 Average:109.20 Median:109.50 stddev:1.81 (1.7%) stddev-sans-first:1.92 05:17:56 INFO - PROCESS | 31111 | Values: 109.0 105.0 109.0 108.0 110.0 109.0 109.0 111.0 111.0 111.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#1] audio-beat-detection Cycles:10 Average:148.00 Median:153.50 stddev:23.35 (15.2%) stddev-sans-first:24.67 05:17:56 INFO - PROCESS | 31111 | Values: 154.0 125.0 129.0 186.0 124.0 158.0 153.0 130.0 185.0 136.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#2] audio-dft Cycles:10 Average:161.40 Median:162.00 stddev:0.97 (0.6%) stddev-sans-first:1.01 05:17:56 INFO - PROCESS | 31111 | Values: 161.0 161.0 161.0 162.0 160.0 162.0 163.0 160.0 162.0 162.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#3] audio-fft Cycles:10 Average:82.50 Median:75.00 stddev:17.55 (23.4%) stddev-sans-first:18.40 05:17:56 INFO - PROCESS | 31111 | Values: 75.0 74.0 74.0 127.0 75.0 76.0 75.0 75.0 100.0 74.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#4] audio-oscillator Cycles:10 Average:97.10 Median:85.00 stddev:19.54 (23.0%) stddev-sans-first:20.14 05:17:56 INFO - PROCESS | 31111 | Values: 84.0 85.0 121.0 85.0 85.0 87.0 121.0 85.0 85.0 133.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#5] imaging-gaussian-blur Cycles:10 Average:116.20 Median:116.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 05:17:56 INFO - PROCESS | 31111 | Values: 116.0 116.0 116.0 116.0 116.0 116.0 116.0 117.0 117.0 116.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#6] imaging-darkroom Cycles:10 Average:146.40 Median:146.50 stddev:1.07 (0.7%) stddev-sans-first:1.13 05:17:56 INFO - PROCESS | 31111 | Values: 146.0 146.0 148.0 146.0 147.0 145.0 148.0 147.0 146.0 145.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#7] imaging-desaturate Cycles:10 Average:95.00 Median:95.00 stddev:0.67 (0.7%) stddev-sans-first:0.60 05:17:56 INFO - PROCESS | 31111 | Values: 94.0 95.0 96.0 95.0 94.0 95.0 96.0 95.0 95.0 95.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#8] json-parse-financial Cycles:10 Average:52.90 Median:53.50 stddev:1.10 (2.1%) stddev-sans-first:0.93 05:17:56 INFO - PROCESS | 31111 | Values: 51.0 52.0 54.0 53.0 52.0 54.0 54.0 53.0 52.0 54.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#9] json-stringify-tinderbox Cycles:10 Average:61.90 Median:62.00 stddev:0.57 (0.9%) stddev-sans-first:0.50 05:17:56 INFO - PROCESS | 31111 | Values: 61.0 62.0 62.0 62.0 62.0 61.0 62.0 62.0 63.0 62.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#10] stanford-crypto-aes Cycles:10 Average:86.20 Median:81.00 stddev:16.21 (20.0%) stddev-sans-first:16.99 05:17:56 INFO - PROCESS | 31111 | Values: 79.0 86.0 79.0 81.0 81.0 80.0 81.0 82.0 132.0 81.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#11] stanford-crypto-ccm Cycles:10 Average:126.00 Median:124.00 stddev:7.76 (6.3%) stddev-sans-first:8.22 05:17:56 INFO - PROCESS | 31111 | Values: 125.0 123.0 140.0 120.0 120.0 123.0 119.0 120.0 137.0 133.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.70 Median:164.00 stddev:1.83 (1.1%) stddev-sans-first:1.50 05:17:56 INFO - PROCESS | 31111 | Values: 167.0 162.0 162.0 166.0 164.0 163.0 165.0 164.0 162.0 162.0 05:17:56 INFO - PROCESS | 31111 | 05:17:56 INFO - PROCESS | 31111 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.00 Median:65.50 stddev:2.79 (4.3%) stddev-sans-first:2.86 05:17:56 INFO - PROCESS | 31111 | Values: 67.0 70.0 66.0 64.0 65.0 68.0 64.0 62.0 63.0 61.0 05:17:56 INFO - PROCESS | 31111 | -------- Summary: end -------- 05:17:56 INFO - PROCESS | 31111 | 05:17:57 INFO - TEST-INFO | 31111: exit 0 05:17:57 INFO - TEST-OK | kraken | took 60985ms 05:17:57 INFO - SUITE-END | took 1173s 05:17:57 INFO - Completed test suite (00:19:33) 05:17:57 INFO - javascript benchmark 05:17:58 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3089.78371513994, 3100.1784527100335, 3118.8752449902004, 3142.1987393214727, 3156.6685498022707, 5151.356080489939, 5234.895302093956, 5254.553362964148, 5324.307839980802, 5338.519533242007, 5237.816676416326, 5287.524122828944, 5299.28459657946, 5328.307320048398, 5336.146216605344, 4786.425628924525, 4800.615950723951, 4846.757662116897, 4855.708657480563, 4958.454569997315, 4862.8410328316395, 4890.951090489085, 4918.385201849769, 4932.53140951609, 4947.8268260610885, 4718.268668356393, 4732.83435079774, 4752.619790416776, 4788.928166077511, 4852.369192005034, 4706.835260765857, 4724.0, 4725.740084295362, 4788.377510923558, 4832.73419961902, 4731.266653668687, 4766.285057241407, 4769.403824521934, 4769.57073863354, 4806.759662016885, 5073.949260507421, 5121.871953201163, 5190.584753219733, 5248.448912864133, 5253.816116435944, 5633.802816901389, 5652.660840349592, 5653.349864765563, 5689.772409103631, 5693.516051135658, 5483.890322193573, 5671.120976248688, 5675.120356344773, 5717.71411429431, 5725.742341594639, 5291.497307755757, 5358.705271210082, 5361.3030306060355, 5440.863978400572, 5442.972785136049, 5895.764169433174, 5903.881922361528, 5912.9113063304085, 5915.497182739429, 5925.288965324189, 5376.838694839161, 5679.943200568024, 5689.601727879091, 5690.231818704505, 5692.402297758758, 5636.379998200195, 5702.116171993348, 5709.885802283931, 5732.627379220337, 5789.536837053026, 5665.801696940587, 5671.631343962629, 5673.943260567424, 5676.77292908279, 5742.081266997344, 5442.428545002717, 5499.697516636544, 5652.0, 5708.0, 5709.429057094258, 4261.87214383569, 4292.763897985641, 4298.677599180074, 4339.457567804025, 4342.435483387139, 3836.731428799957, 3852.3643598806443, 3860.189360234382, 3881.029742564359, 3895.3572660511263, 5191.844244672666, 5266.8419947401635, 5290.0, 5317.096093664087, 5332.120200167006, 5658.377578466366, 5674.26234589509, 5678.602497825195, 5679.602427830095, 5739.2252045973255, 5307.071262529042, 5321.840344789663, 5327.680339179584, 5328.227407025959, 5328.573714102862, 4643.349931009661, 4717.363155973968, 4744.1934871072, 4765.070811191854, 4785.832495862628, 5876.7355469004, 5890.204822349014, 5890.293164820249, 5892.528597712173, 5935.703214839241, 5707.600467967285, 5717.514011308919, 5718.571107167062, 5720.941625799241, 5723.0, 5673.5461163107675, 5731.627444216113, 5752.71236438168, 5784.334801497714, 5867.73595188209, 5533.170024496358, 5536.972315138399, 5540.889182216414, 5541.2796336476, 5547.528460080938, 5626.971865140812, 5655.519280861008, 5672.631278966854, 5676.602637815313, 5680.517156041617, 5437.966786310589, 5467.9453205467435, 5513.393526712139, 5531.308586426697, 5544.556435485232, 5536.390996990408, 5538.750756216061, 5540.91688624679, 5546.057170280981, 5550.222968784293, 5334.866628334323, 5402.108652072364, 5444.96545656324, 5461.2627295316215, 5512.889742205213, 5455.672659640434, 5473.0, 5513.558915286687, 5611.130274807411, 5617.831465056055, 5445.918311225256, 5447.182922561489, 5448.591355648421, 5449.754761035683, 5497.0], "value": 5213.948004901355, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [593.4036293525006, 602.9427204415579, 626.6177631644697, 631.1605564599083, 638.3297537585534, 33703.83148084262, 42142.789286053565, 43640.3453948191, 43661.56338436623, 46036.38872639458, 44764.552354476444, 45053.0, 45180.0, 45286.867828304225, 45298.77350613242, 8592.570371481417, 8720.17158369957, 8772.824543509127, 8776.517291548962, 8783.692570760024, 8584.0557538671, 8759.693410730593, 8765.649374025063, 8775.824483510358, 8785.253253473462, 8792.560371981408, 8818.735437936872, 8860.778480537974, 8878.24534914533, 8881.1118888111, 8729.912700872974, 8750.25622822064, 8771.73684789451, 8775.605097770616, 8789.472631642122, 8655.653773849039, 8731.432456890345, 8739.912600873973, 8746.344024198146, 8755.168259015383, 41052.79473602643, 41440.79279603583, 41446.37830432546, 41465.378019329735, 41481.377779333336, 3453.9138559096605, 3608.6932610728118, 3646.3254297954963, 3873.0704630888667, 4126.8761937141635, 31530.842345788355, 31798.205044873834, 31996.360072798645, 32108.518372224436, 33597.0, 3864.2271545690974, 3982.38273067675, 4064.2074795414906, 4075.347944328923, 4156.459660244149, 230259.0, 230270.0, 230622.0, 231303.9999999983, 231950.0, 54883.72558137264, 54957.45042549523, 55079.0, 55146.72426637841, 55199.0, 57612.0, 57819.0, 57925.420745792006, 58000.0, 58012.0, 14466.27668616586, 14497.855021449861, 14513.0, 14592.781108283385, 14761.261936903327, 10824.0, 10885.510152043176, 10918.72703182411, 10922.0, 10946.069584085282, 14202.431902723776, 15449.691006179813, 15467.149306788235, 15587.610309742347, 15651.452199172974, 5432.809851655173, 6181.165542651775, 6533.314002029813, 6567.211934567787, 6571.178602674666, 1019.954102065394, 1029.2846471702244, 1065.3820783945448, 1168.2172944127456, 1168.9006434453167, 31484.527732084036, 31997.8400107998, 32035.839820800746, 32273.677263227535, 32967.0, 1102.9172812039128, 1135.6365962891796, 1157.2542327344775, 1238.2570457725292, 1256.108163204117, 16782.83217167813, 16866.241019153924, 16875.57811054709, 16884.57788555296, 16911.577210569587, 567660.0, 572831.0, 574468.0, 575442.0, 576497.0, 56139.71930140323, 58111.0, 58185.0, 58251.12623310654, 58299.0, 1277.8594354620984, 1294.1652634050984, 1308.738252349534, 1398.0912406935574, 1401.4884567132924, 27045.86477067602, 32165.839170803996, 32369.838150809097, 32905.17737056497, 33778.49332259969, 48012.0, 48032.0, 48388.0, 48454.0, 48479.84880982725, 426498.0, 429836.0, 432023.0, 433995.0, 434648.0, 38657.42013869851, 38915.61084389233, 40218.0, 40380.798096009334, 40469.59530404658, 45765.31352029656, 46647.76676116598, 46703.766481167375, 47358.76320618375, 47918.76040619775, 40346.97243695424, 40887.1822563553, 41305.793471032455, 41358.1728365437, 42124.15751685011, 39622.40566391564, 40018.39972400358, 40486.79756601316, 40844.387334189414, 41630.58369416267, 40468.392974106, 41419.378709319986, 41572.3764143532, 41624.3756343649, 41796.3730544036, 34471.0, 35999.820000899825, 36689.44965825568, 37213.25573488461, 37410.8129459351, 27189.59215611807, 27586.448271034868, 27852.72147278501, 27897.860510697315, 27989.0], "value": 19639.53121720337, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [387.27965983271093, 389.6571017504596, 397.4296883971503, 406.70107471008805, 406.94913135858013, 14143.434262629482, 16556.50330490087, 18097.638047239063, 19589.412317630475, 19629.11668974896, 14496.20270885101, 16752.0, 17760.378386756467, 18102.728459073125, 18190.545236369097, 5497.697626630534, 5499.7250137493165, 5590.944090559104, 5595.272614560122, 5689.6017278790505, 4010.077682133111, 5531.917021244684, 5614.66312021278, 5655.4910058094765, 5865.9413405866035, 6201.875962480748, 6285.622862628234, 6305.621662700252, 6313.273973493061, 6317.463015643676, 6147.10866924298, 6258.436740693337, 6301.936980630181, 6357.777477788301, 6362.427381535661, 5563.554915606782, 5566.666000040011, 5568.331800183963, 5573.498385145316, 5574.916376254359, 20730.0, 21835.890820545796, 22019.66970495444, 22290.554188916132, 22305.219317323816, 2462.5936720441287, 2516.2828593850663, 2529.2285852814884, 2567.165671156863, 2574.382148284417, 13048.217106973612, 13237.86762132376, 13635.795463068062, 13813.102148360324, 14032.859671403257, 1897.601503684214, 1948.1915005272795, 1985.2158397433077, 2011.6680747676617, 2019.151956178394, 70823.0, 76711.23288767097, 78738.0, 79115.0, 79247.6037619814, 9546.90453095474, 10258.692239232834, 11056.834147487794, 11080.0, 11227.27022743519, 15181.62045948838, 15296.694066118615, 15304.923475382775, 15316.923415382851, 15323.0, 6917.9654101730175, 7126.180489243699, 7393.852122957511, 7612.3148916597775, 7715.729949451742, 6925.896111558331, 6953.235144134142, 7138.8220943544775, 7260.600666963368, 7384.409247260206, 4377.759223242752, 4449.866504004885, 4637.466691330473, 4786.64100192487, 4803.807847686124, 1958.4614231086566, 1959.5101224693826, 1964.5776158125786, 1989.890715841213, 1992.6413245615638, 898.501331760879, 983.3165949664914, 1012.422918936214, 1057.830747080479, 1090.8145615245269, 18397.172127254307, 18740.437786866416, 18991.90504047471, 19000.334988275343, 19200.903995479934, 973.6932866147141, 980.8185485685171, 1032.3083534032216, 1071.0146665068155, 1075.070064394309, 10279.280450368551, 10615.68152955397, 10624.893751062546, 10634.680959571226, 10644.0, 435621.0, 451312.97374052333, 464982.0, 465132.0, 465294.0, 94828.52585737027, 95292.52353738187, 95322.52338738262, 96901.0, 98489.0, 982.749398903275, 1007.1288335589662, 1007.9848802267971, 1019.4036488654073, 1031.783325501638, 16388.672226555165, 16571.751423728896, 16600.169991500617, 16747.33010679559, 16838.747418788975, 40397.59602404056, 40415.191696165326, 41000.58999410087, 42119.0, 43306.0, 40441.79779101086, 48963.26555101605, 50371.74814126053, 55090.72454637701, 58667.0, 7673.61631918413, 7886.526808391515, 8040.115587285511, 8224.958875205824, 8307.501549907025, 8975.640974361213, 10964.780704386027, 12848.743025139258, 12870.806937896126, 13243.271620060988, 11853.881461185278, 11905.107116966436, 11961.880381196424, 11989.580364687194, 12089.0, 11621.24461909973, 11737.706557335794, 11760.70598235051, 11786.292822430682, 11952.0, 10912.672619821418, 11609.419529023684, 11616.0, 11708.536432945883, 12039.699007524532, 8233.629486672995, 8243.299319557906, 8319.958400207961, 8352.41533092702, 8401.70594029206, 8507.319414446953, 10742.73143171427, 11911.3448760319, 11930.403479826147, 12120.878791211975], "value": 9082.520122977327, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1389.2914613547089, 1481.214956073281, 1531.3338697666516, 1676.6143786929006, 1850.5188650950756, 8440.282575981042, 8793.736187914374, 8804.955975220131, 8807.0, 8810.999999999993, 8541.871871921927, 8722.563871806417, 8734.257588105003, 8738.169873861973, 8760.605772740226, 2002.2791794953805, 2074.1392322186275, 2197.560487902414, 2232.352617740861, 2253.4591697992446, 2321.8490798098155, 2347.94130146746, 2349.89425475854, 2350.682657841195, 2350.788429041386, 2293.6674182243564, 2305.7348404933477, 2320.269115228706, 2323.2797832671927, 2326.3718795925092, 1947.4839167620662, 2168.230278251214, 2246.2587346175724, 2288.8168946484243, 2321.663358812971, 2255.9661605075935, 2291.724993000834, 2292.358139720864, 2294.357579877637, 2295.368773587277, 8646.610902509403, 8761.299096072362, 8762.561871906379, 8766.474011559263, 8768.210861022475, 5053.823116190915, 5188.740562971836, 5194.948050519484, 5195.792168313263, 5197.948020519784, 3192.728618067467, 3221.500667396534, 3383.881564145243, 3389.3390788796196, 3395.5246265522846, 1162.2851946053202, 1163.1741463560882, 2083.8851214600118, 2141.871487710727, 2186.5954798362354, 11700.765984680258, 11761.353125578089, 11766.058715302755, 11778.587749428814, 11780.352080635561, 4202.663786897041, 4265.317549192177, 4273.722208056529, 4347.847825326162, 4348.565143485626, 9274.0, 9375.765605859908, 9383.812323753487, 9384.8592271116, 9417.340786144903, 4939.975300123477, 4946.356973593482, 4946.604271658259, 4948.8762780930765, 4952.182889823139, 4266.189424009428, 4626.1441633297945, 4626.791794369262, 4715.316279139505, 4732.692374995614, 3642.5993140754495, 3649.251903359805, 3732.8320225589914, 3792.412176112707, 3804.923901521954, 1097.6981330134277, 1125.2292179856825, 1129.5594718059963, 1146.1289420040662, 1153.140910022039, 867.3104881619001, 960.524540352516, 968.0899954043177, 992.2905122837207, 1000.8748906386702, 5802.912956305659, 5839.474447299764, 5841.707914604338, 5941.0, 5954.55340849438, 413.50586049670954, 419.1637682822727, 423.14102372184516, 425.402309754795, 427.24164607821365, 4140.109876376593, 4155.937660935088, 4156.168766246763, 4169.0, 4186.58134186585, 10262.897371026344, 10657.360558366523, 10670.57317707283, 10686.358818470917, 10699.732506687395, 10563.102136318344, 10567.365958042543, 10569.260151789455, 10571.788564228673, 10586.788264234672, 7759.0, 8012.919870801217, 8050.436469447082, 8050.4767190133625, 8057.395695322874, 5836.591438599427, 5872.882542349043, 6001.279846418458, 6067.0, 6214.316425193316, 9484.430934143973, 9831.459269740233, 9894.158996485092, 9958.15355694745, 10032.347897386646, 9981.550830212513, 10148.13740832008, 10168.796624067625, 10240.0, 10300.536475858455, 6893.689783959633, 7446.404287657083, 7548.131964824115, 7683.154852966281, 7990.0, 8642.654293828176, 8645.135486451556, 8683.0, 8727.56362181901, 8750.0, 7546.24537546241, 7597.6201189939175, 7629.427792915442, 7740.574268415066, 7924.247196516321, 7527.661255243636, 7543.321101100927, 7652.234776522526, 7766.068071831416, 7782.649780759993, 6965.373116419547, 7034.331738484836, 7038.894416583653, 7040.436765058886, 7055.047568578177, 5029.29589857413, 5092.465291144525, 5190.299309593157, 5202.505761952609, 5310.601704872072, 5202.765875535686, 5298.1258092415865, 5303.4431384705595, 5348.331458567679, 5357.598180136583], "value": 4500.099138315506, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [318.15688425671965, 324.4468181750116, 331.65839185638794, 332.21265600526755, 332.53113110514164, 5318.813841515548, 5333.733313334337, 5364.678119312844, 5381.5963802714805, 5387.545362752055, 5266.34170728659, 5279.41926388098, 5286.259923610688, 5313.442088580691, 5339.305890234274, 3777.8677746278886, 3963.365861462167, 4089.018635527482, 4114.711970162075, 4115.691323150761, 4140.730852494578, 4144.0, 4144.274751918418, 4162.666986641077, 4192.7693976831415, 4060.20825938942, 4062.7765472898977, 4064.0, 4103.425520427142, 4125.649319807805, 3918.7060970427333, 3939.5075615548058, 4070.715049946505, 4138.937915931264, 4140.109876376563, 3545.468179773029, 3552.7513074084823, 3564.215872508044, 3566.375884220251, 3567.1438854674952, 5053.671511351788, 5077.441481437039, 5093.592512598983, 5150.304708864331, 5172.27588137661, 4491.303847903548, 4688.882777930545, 4702.6002789762915, 4727.243641017455, 4728.196206644879, 5534.557235421156, 5537.695426751527, 5547.223388725582, 5555.30558680165, 5566.66600003997, 3990.2418540477215, 3990.5809889961424, 4015.6385925266572, 4018.5177778666457, 4024.094578719794, 5651.802186923438, 5674.744636491368, 5702.65784052954, 5843.298804143487, 5862.237909071836, 4089.875284296842, 4116.279651061052, 4121.5466298707115, 4127.772972486542, 4134.37984302351, 4156.713807405915, 4171.416001759756, 4176.477940257468, 4180.770057646859, 4187.309093999456, 4543.0, 4737.313089601988, 4743.83396581118, 4762.238041913347, 4772.260299653559, 5546.251256080458, 5548.223248745179, 5552.611317207757, 5562.193481945095, 5562.415946325577, 1432.777919422491, 1436.7198396312829, 1443.6968236670207, 1462.393106860662, 1466.5013895275658, 902.4720538484928, 909.8180363927241, 919.1222382624577, 941.0354386753633, 965.5944503308486, 4714.669973101919, 4725.881852953704, 4775.761211939459, 4799.568038876518, 4837.346958160603, 5074.517920797518, 5076.99458713806, 5087.949120508822, 5113.028524580318, 5141.38303403594, 4498.437695288089, 4635.536446355338, 4705.882352941136, 4813.9037219256115, 4816.301636262722, 2693.501702185102, 2695.4339588686594, 2705.418335057972, 2708.510319324403, 2716.714744951791, 5218.6868787872845, 5224.190250511177, 5231.607629427732, 5238.895222095537, 5284.260203571503, 4861.295112208781, 5136.717480538607, 5151.141116680278, 5180.663256888365, 5495.505404513613, 5749.482546570829, 5848.883022339614, 5883.14694369314, 5933.406659334032, 5957.880842383215, 5727.8568035799435, 5728.684922329312, 5731.770729170787, 5736.971315143398, 5740.253767010262, 5385.0, 5660.632058916157, 5662.8301150965535, 5671.313646129884, 5701.945140149086, 5899.0, 5908.704564771659, 5911.078899357812, 5924.4667979882015, 5939.10913362999, 4157.064660451374, 4191.371294305878, 4202.705810593351, 4216.599423054805, 4217.536071032123, 5517.889642207053, 5660.7169641518585, 5689.260396148474, 5701.600887937804, 5759.856003599776, 5535.225068490334, 5538.335399752055, 5575.832725018256, 5629.78959523688, 5637.661740295432, 5353.678779273256, 5590.44095590454, 5592.636478628876, 5613.775448982158, 5637.802676906289, 5460.31746031746, 5505.201745746765, 5506.559475241891, 5514.228008078792, 5540.75066622011, 5615.887682246251, 5634.873025394855, 5640.576956728344, 5642.463965923231, 5643.52030077448, 5299.099153144052, 5403.216533602685, 5433.320834895638, 5460.890782184255, 5522.950639378505], "value": 4161.012340032371, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [718.0547244736985, 797.0767260518497, 820.9630566624503, 831.4803247970019, 833.8874251975982, 14686.41254349826, 14780.334884930176, 15367.462138825116, 15477.38090476381, 15490.845091549081, 14804.40782368704, 14962.25188740564, 14980.25098745061, 14984.550463486086, 14984.550463486086, 813.1461964936808, 819.5615345790004, 823.0987069159261, 825.3644693585935, 825.781167990483, 658.6410406328539, 778.1984555907425, 795.2842441802367, 821.7699044267615, 826.6982551368737, 799.4124318625805, 800.6917336825306, 803.1406395157184, 804.8873157757919, 806.3267171911461, 682.1405029662611, 829.3613917283687, 830.9127541608135, 832.1803024021365, 835.1439774231401, 587.6591576885396, 615.5783288447428, 621.5183232994466, 621.6705146272483, 622.5766478794418, 14762.630934226623, 14994.175320357375, 15006.474773382879, 15011.099334039993, 15026.849731502654, 14230.075045122137, 14711.485098021518, 14813.925930370388, 14890.404383824634, 15094.16982065986, 13195.340232988312, 13242.66893327665, 13244.735105297936, 13426.731465370736, 13870.861291387158, 4460.30865215892, 4494.303382975611, 4625.306204069417, 4689.226277664216, 4714.339992401066, 73181.6340918292, 74259.62870185668, 75949.99999999945, 76437.61781191059, 77096.61451692706, 11827.881721182677, 11879.22785018971, 11914.940425297818, 11946.283223006647, 11950.462229199708, 21973.23093691713, 22033.118675253132, 22061.227857024925, 22082.33752987413, 22162.33512994613, 8471.217725069793, 8554.61504232311, 8574.0, 8584.098669639723, 8722.86915696265, 4718.150732868048, 4828.975855120702, 4841.419029716457, 4841.733704646208, 4882.8779280517565, 3344.9832750836576, 3441.5181874537584, 3443.5867695876154, 3444.3111377724554, 3445.5176275321473, 598.7215944585702, 607.2439812433548, 608.2822269721682, 610.2036841921336, 615.8460384903774, 664.4451882678018, 703.2369878681585, 715.53490231349, 715.5527795128045, 716.6345163966415, 10104.141148002502, 10147.695569132939, 10190.541425635864, 10206.234532410099, 10208.948955255177, 636.6530241018656, 646.7380710812129, 700.7827573452246, 702.6170736948376, 722.663961258007, 4476.731396116244, 4622.699524530894, 4623.583877451046, 4656.604188643935, 4737.526247375235, 66160.0, 87932.0, 108556.45721771341, 114893.4255328718, 115646.0, 97855.0, 98378.50810746044, 100129.49935250277, 101192.0, 101519.0, 88218.0, 90175.0, 90178.54910725536, 90320.54839725759, 90796.09203908009, 8162.632681529464, 8442.831143377221, 8647.221750042527, 8709.651613935624, 8970.820583588422, 46718.0, 47872.281915771986, 50120.74939625424, 50174.70857017716, 50896.49103508917, 71941.6402917982, 74788.62605686937, 74923.62538187274, 75063.24936750563, 77128.2287177121, 11505.597304094317, 11515.769684606428, 11770.82343764827, 11804.704882377666, 12133.272003679807, 12516.812247816108, 12743.808842867178, 12996.090273680751, 13008.349582521025, 13333.066685331934, 12344.62966111018, 12447.190932589352, 12474.251544907334, 12498.687532811753, 12510.712074303405, 12115.697107572381, 12531.624051278477, 12652.493900243888, 12855.87144128584, 13293.601191964257, 12411.17293988358, 12738.363081846055, 12820.038497112568, 13111.409986550438, 13191.40638671243, 9948.751281218027, 10145.87437348815, 10263.486825658836, 10363.430011349448, 10395.116415104498, 9563.952180239054, 9704.272179586418, 10355.223358248011, 10411.94794026025, 10464.47677616101], "value": 7418.491617635024, "unit": "score"}], "name": "dromaeo_css", "value": 7110.189429725048, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 105.0, 109.0, 108.0, 110.0, 109.0, 109.0, 111.0, 111.0, 111.0], "value": 109.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 125.0, 129.0, 186.0, 124.0, 158.0, 153.0, 130.0, 185.0, 136.0], "value": 148.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 161.0, 162.0, 160.0, 162.0, 163.0, 160.0, 162.0, 162.0], "value": 161.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 74.0, 127.0, 75.0, 76.0, 75.0, 75.0, 100.0, 74.0], "value": 82.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 121.0, 85.0, 85.0, 87.0, 121.0, 85.0, 85.0, 133.0], "value": 97.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 116.0, 116.0, 116.0, 116.0, 116.0, 116.0, 117.0, 117.0, 116.0], "value": 116.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 148.0, 146.0, 147.0, 145.0, 148.0, 147.0, 146.0, 145.0], "value": 146.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 96.0, 95.0, 94.0, 95.0, 96.0, 95.0, 95.0, 95.0], "value": 95.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [51.0, 52.0, 54.0, 53.0, 52.0, 54.0, 54.0, 53.0, 52.0, 54.0], "value": 52.9, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 62.0, 62.0, 62.0, 62.0, 61.0, 62.0, 62.0, 63.0, 62.0], "value": 61.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 86.0, 79.0, 81.0, 81.0, 80.0, 81.0, 82.0, 132.0, 81.0], "value": 86.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [125.0, 123.0, 140.0, 120.0, 120.0, 123.0, 119.0, 120.0, 137.0, 133.0], "value": 126.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 162.0, 162.0, 166.0, 164.0, 163.0, 165.0, 164.0, 162.0, 162.0], "value": 163.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 70.0, 66.0, 64.0, 65.0, 68.0, 64.0, 62.0, 63.0, 61.0], "value": 65.0, "unit": "score"}], "name": "kraken", "value": 1511.5000000000002, "alertThreshold": 2.0}]} 05:17:58 INFO - Return code: 0 05:17:58 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:17:58 ERROR - # TBPL SUCCESS # 05:17:58 INFO - Running post-action listener: _resource_record_post_action 05:17:58 INFO - ##### 05:17:58 INFO - ##### Finished run-tests step (success) 05:17:58 INFO - ##### 05:17:58 INFO - Running post-run listener: _resource_record_post_run 05:17:58 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 0; Write bytes: 542257152; Read time: 0; Write time: 532640 05:17:58 INFO - TinderboxPrint: CPU usage
13.2% 05:17:58 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 05:17:58 INFO - TinderboxPrint: I/O write bytes / time
542,257,152 / 532,640 05:17:58 INFO - TinderboxPrint: CPU idle
8,257.6 (86.8%) 05:17:58 INFO - TinderboxPrint: CPU user
1,211.6 (12.7%) 05:17:58 INFO - TinderboxPrint: Swap in / out
0 / 0 05:17:58 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 247492608; Read time: 0; Write time: 274436 05:17:58 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 294268928; Read time: 0; Write time: 258176 05:17:58 INFO - Running post-run listener: _upload_blobber_files 05:17:58 INFO - Blob upload gear active. 05:17:58 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:17:58 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 05:17:58 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'] 05:17:58 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 05:17:59 INFO - (blobuploader) - INFO - Open directory for files ... 05:17:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 05:17:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:17:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:17:59 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 05:17:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:17:59 INFO - (blobuploader) - INFO - Done attempting. 05:17:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:17:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:17:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:18:04 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:18:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:18:04 INFO - (blobuploader) - INFO - Done attempting. 05:18:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 05:18:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:18:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:18:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 05:18:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:18:05 INFO - (blobuploader) - INFO - Done attempting. 05:18:05 INFO - (blobuploader) - INFO - Iteration through files over. 05:18:05 INFO - Return code: 0 05:18:05 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:18:05 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:18:05 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/340c8aca41dcc7eb68a98d613dd3c22cbadb74be576b29e4f26a3e4ac6e390058ee9e7888b08fd5480fe02bdc70a38d4afb8061ac806e04519cf81143102c65a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/83a05d01e37a59e703eace18bc3b3967717f45d4c6e4af37c7f441ddb5d0000b58c1022dd7347714b2eaf8c598a6b759c4ab995e4c1d432194d9c5cc8b97fe38", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f9678f56787412596b3aa2dcb57b1a8c72a04b98dc63176e2f3aac5b9611bf9053386bc3814bc35239ef914d1d45fae678993612fb050bb0f05b935d05f5f762"} 05:18:05 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:18:05 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:18:05 INFO - Contents: 05:18:05 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/340c8aca41dcc7eb68a98d613dd3c22cbadb74be576b29e4f26a3e4ac6e390058ee9e7888b08fd5480fe02bdc70a38d4afb8061ac806e04519cf81143102c65a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/83a05d01e37a59e703eace18bc3b3967717f45d4c6e4af37c7f441ddb5d0000b58c1022dd7347714b2eaf8c598a6b759c4ab995e4c1d432194d9c5cc8b97fe38", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f9678f56787412596b3aa2dcb57b1a8c72a04b98dc63176e2f3aac5b9611bf9053386bc3814bc35239ef914d1d45fae678993612fb050bb0f05b935d05f5f762"} 05:18:05 INFO - Running post-run listener: copy_logs_to_upload_dir 05:18:05 INFO - Copying logs to upload dir... 05:18:05 INFO - mkdir: /builds/slave/test/build/upload/logs 05:18:05 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.018136 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 41 secs) (at 2016-06-07 05:18:05.158259) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-07 05:18:05.162210) ========= 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=a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487 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/340c8aca41dcc7eb68a98d613dd3c22cbadb74be576b29e4f26a3e4ac6e390058ee9e7888b08fd5480fe02bdc70a38d4afb8061ac806e04519cf81143102c65a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/83a05d01e37a59e703eace18bc3b3967717f45d4c6e4af37c7f441ddb5d0000b58c1022dd7347714b2eaf8c598a6b759c4ab995e4c1d432194d9c5cc8b97fe38", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f9678f56787412596b3aa2dcb57b1a8c72a04b98dc63176e2f3aac5b9611bf9053386bc3814bc35239ef914d1d45fae678993612fb050bb0f05b935d05f5f762"} build_url:https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011542 build_url: 'https://queue.taskcluster.net/v1/task/cLJdxxO8SB-zVBlqpzJzFg/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/340c8aca41dcc7eb68a98d613dd3c22cbadb74be576b29e4f26a3e4ac6e390058ee9e7888b08fd5480fe02bdc70a38d4afb8061ac806e04519cf81143102c65a", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/83a05d01e37a59e703eace18bc3b3967717f45d4c6e4af37c7f441ddb5d0000b58c1022dd7347714b2eaf8c598a6b759c4ab995e4c1d432194d9c5cc8b97fe38", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/f9678f56787412596b3aa2dcb57b1a8c72a04b98dc63176e2f3aac5b9611bf9053386bc3814bc35239ef914d1d45fae678993612fb050bb0f05b935d05f5f762"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-07 05:18:05.187611) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 05:18:05.187968) ========= 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=a0d2d2de893abaa8702a9954000001a7-1465300314.517445-1935404487 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004574 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-07 05:18:05.271712) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-07 05:18:05.272043) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-07 05:18:05.272348) ========= ========= Total master_lag: 0.18 =========