builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-037 starttime: 1447974699.01 results: success (0) buildid: 20151119135314 builduid: c0493d84e1314e5f8a0af630ae2a5a33 revision: 0c351448cd9f4224bf98709d04e6623b52eef8b0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.015580) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.016067) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.016401) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] 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=6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.005148 basedir: '/builds/slave/test' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.033481) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.033826) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.042989) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.043366) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', '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=6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.003910 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.091431) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.091743) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.092104) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.092376) ========= 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=6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-19 15:11:39-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 43.7M=0s 2015-11-19 15:11:39 (43.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.197676 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.302500) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.302848) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] 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=6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016406 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:39.353126) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-19 15:11:39.353498) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 0c351448cd9f4224bf98709d04e6623b52eef8b0 --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 0c351448cd9f4224bf98709d04e6623b52eef8b0 --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=6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-19 15:11:39,822 truncating revision to first 12 chars 2015-11-19 15:11:39,822 Setting DEBUG logging. 2015-11-19 15:11:39,822 attempt 1/10 2015-11-19 15:11:39,822 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/0c351448cd9f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-19 15:11:40,949 unpacking tar archive at: fx-team-0c351448cd9f/testing/mozharness/ program finished with exit code 0 elapsedTime=1.452180 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-19 15:11:40.818464) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:40.818799) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:40.827645) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:40.828155) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-19 15:11:40.828646) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 22 secs) (at 2015-11-19 15:11:40.828967) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:11:41 INFO - MultiFileLogger online at 20151119 15:11:41 in /builds/slave/test 15:11:41 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 15:11:41 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:11:41 INFO - {'append_to_log': False, 15:11:41 INFO - 'base_work_dir': '/builds/slave/test', 15:11:41 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 15:11:41 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:11:41 INFO - 'branch': 'Fx-Team-Non-PGO', 15:11:41 INFO - 'buildbot_json_path': 'buildprops.json', 15:11:41 INFO - 'config_files': ('talos/linux_config.py',), 15:11:41 INFO - 'default_actions': ('clobber', 15:11:41 INFO - 'read-buildbot-config', 15:11:41 INFO - 'download-and-extract', 15:11:41 INFO - 'populate-webroot', 15:11:41 INFO - 'create-virtualenv', 15:11:41 INFO - 'install', 15:11:41 INFO - 'run-tests'), 15:11:41 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:11:41 INFO - 'download_minidump_stackwalk': True, 15:11:41 INFO - 'download_symbols': 'ondemand', 15:11:41 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:11:41 INFO - 'tooltool.py': '/tools/tooltool.py', 15:11:41 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:11:41 INFO - '/tools/misc-python/virtualenv.py')}, 15:11:41 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:11:41 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:11:41 INFO - 'installer_path': 'installer.exe', 15:11:41 INFO - 'log_level': 'info', 15:11:41 INFO - 'log_name': 'talos', 15:11:41 INFO - 'log_to_console': True, 15:11:41 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:11:41 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:11:41 INFO - 'opt_config_files': (), 15:11:41 INFO - 'pip_index': False, 15:11:41 INFO - 'sps_profile': False, 15:11:41 INFO - 'sps_profile_interval': 0, 15:11:41 INFO - 'suite': 'dromaeojs', 15:11:41 INFO - 'system_bits': '64', 15:11:41 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:11:41 INFO - 'title': 'talos-linux64-ix-037', 15:11:41 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:11:41 INFO - 'use_talos_json': True, 15:11:41 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:11:41 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:11:41 INFO - 'work_dir': 'build'} 15:11:41 INFO - ##### 15:11:41 INFO - ##### Running clobber step. 15:11:41 INFO - ##### 15:11:41 INFO - Running pre-action listener: _resource_record_pre_action 15:11:41 INFO - Running main action method: clobber 15:11:41 INFO - rmtree: /builds/slave/test/build 15:11:41 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:11:41 INFO - Running post-action listener: _resource_record_post_action 15:11:41 INFO - ##### 15:11:41 INFO - ##### Running read-buildbot-config step. 15:11:41 INFO - ##### 15:11:41 INFO - Running pre-action listener: _resource_record_pre_action 15:11:41 INFO - Running main action method: read_buildbot_config 15:11:41 INFO - Using buildbot properties: 15:11:41 INFO - { 15:11:41 INFO - "properties": { 15:11:41 INFO - "buildnumber": 897, 15:11:41 INFO - "product": "firefox", 15:11:41 INFO - "script_repo_revision": "production", 15:11:41 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 15:11:41 INFO - "repository": "", 15:11:41 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 15:11:41 INFO - "buildid": "20151119135314", 15:11:41 INFO - "slavename": "talos-linux64-ix-037", 15:11:41 INFO - "pgo_build": "False", 15:11:41 INFO - "basedir": "/builds/slave/test", 15:11:41 INFO - "project": "", 15:11:41 INFO - "platform": "ubuntu64_hw", 15:11:41 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 15:11:41 INFO - "slavebuilddir": "test", 15:11:41 INFO - "scheduler": "tests-fx-team-linux64-talos", 15:11:41 INFO - "branch": "fx-team", 15:11:41 INFO - "repo_path": "integration/fx-team", 15:11:41 INFO - "stage_platform": "linux64", 15:11:41 INFO - "builduid": "c0493d84e1314e5f8a0af630ae2a5a33", 15:11:41 INFO - "revision": "0c351448cd9f4224bf98709d04e6623b52eef8b0" 15:11:41 INFO - }, 15:11:41 INFO - "sourcestamp": { 15:11:41 INFO - "repository": "", 15:11:41 INFO - "hasPatch": false, 15:11:41 INFO - "project": "", 15:11:41 INFO - "branch": "fx-team-linux64-talos", 15:11:41 INFO - "changes": [ 15:11:41 INFO - { 15:11:41 INFO - "category": null, 15:11:41 INFO - "files": [ 15:11:41 INFO - { 15:11:41 INFO - "url": null, 15:11:41 INFO - "name": "https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 15:11:41 INFO - } 15:11:41 INFO - ], 15:11:41 INFO - "repository": "", 15:11:41 INFO - "rev": "0c351448cd9f4224bf98709d04e6623b52eef8b0", 15:11:41 INFO - "who": "kwierso@gmail.com", 15:11:41 INFO - "when": 1447973814, 15:11:41 INFO - "number": 6685545, 15:11:41 INFO - "comments": "Merge m-c to fx-team, a=merge", 15:11:41 INFO - "project": "", 15:11:41 INFO - "at": "Thu 19 Nov 2015 14:56:54", 15:11:41 INFO - "branch": "fx-team-linux64-talos", 15:11:41 INFO - "revlink": "", 15:11:41 INFO - "properties": [ 15:11:41 INFO - [ 15:11:41 INFO - "buildid", 15:11:41 INFO - "20151119135314", 15:11:41 INFO - "Change" 15:11:41 INFO - ], 15:11:41 INFO - [ 15:11:41 INFO - "builduid", 15:11:41 INFO - "c0493d84e1314e5f8a0af630ae2a5a33", 15:11:41 INFO - "Change" 15:11:41 INFO - ], 15:11:41 INFO - [ 15:11:41 INFO - "pgo_build", 15:11:41 INFO - "False", 15:11:41 INFO - "Change" 15:11:41 INFO - ] 15:11:41 INFO - ], 15:11:41 INFO - "revision": "0c351448cd9f4224bf98709d04e6623b52eef8b0" 15:11:41 INFO - } 15:11:41 INFO - ], 15:11:41 INFO - "revision": "0c351448cd9f4224bf98709d04e6623b52eef8b0" 15:11:41 INFO - } 15:11:41 INFO - } 15:11:41 INFO - Found installer url https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 15:11:41 INFO - Running post-action listener: _resource_record_post_action 15:11:41 INFO - ##### 15:11:41 INFO - ##### Running download-and-extract step. 15:11:41 INFO - ##### 15:11:41 INFO - Running pre-action listener: _resource_record_pre_action 15:11:41 INFO - Running main action method: download_and_extract 15:11:41 INFO - mkdir: /builds/slave/test/build/tests 15:11:41 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')]} 15:11:41 INFO - https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 15:11:41 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/test_packages.json 15:11:41 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/test_packages.json 15:11:41 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 15:11:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 15:11:42 INFO - Downloaded 1302 bytes. 15:11:42 INFO - Reading from file /builds/slave/test/build/test_packages.json 15:11:42 INFO - Using the following test package requirements: 15:11:42 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 15:11:42 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 15:11:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 15:11:42 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 15:11:42 INFO - u'jsshell-linux-x86_64.zip'], 15:11:42 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 15:11:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 15:11:42 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 15:11:42 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 15:11:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 15:11:42 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 15:11:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 15:11:42 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 15:11:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 15:11:42 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 15:11:42 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 15:11:42 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 15:11:42 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 15:11:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:11:42 INFO - https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:11:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 15:11:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 15:11:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 15:11:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:11:46 INFO - Downloaded 21339275 bytes. 15:11:46 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 15:11:46 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 15:11:46 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 15:11:47 INFO - Return code: 0 15:11:47 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 15:11:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:11:47 INFO - https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 15:11:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 15:11:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 15:11:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 15:11:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:12:06 INFO - Downloaded 21339275 bytes. 15:12:06 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 15:12:06 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 15:12:06 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 15:12:07 INFO - Return code: 0 15:12:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:07 INFO - https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 15:12:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 15:12:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 15:12:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 15:12:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 15:12:08 INFO - Downloaded 11130997 bytes. 15:12:08 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 15:12:08 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 15:12:08 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 15:12:09 INFO - Return code: 0 15:12:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:09 INFO - https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 15:12:09 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 15:12:09 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 15:12:09 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 15:12:09 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 15:12:11 INFO - Downloaded 55782176 bytes. 15:12:11 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 15:12:11 INFO - mkdir: /builds/slave/test/properties 15:12:11 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:12:11 INFO - Writing to file /builds/slave/test/properties/build_url 15:12:11 INFO - Contents: 15:12:11 INFO - build_url:https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 15:12:11 INFO - Running post-action listener: _resource_record_post_action 15:12:11 INFO - Running post-action listener: set_extra_try_arguments 15:12:11 INFO - ##### 15:12:11 INFO - ##### Running populate-webroot step. 15:12:11 INFO - ##### 15:12:11 INFO - Running pre-action listener: _resource_record_pre_action 15:12:11 INFO - Running main action method: populate_webroot 15:12:11 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:12:11 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:12:11 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 15:12:11 INFO - '../fennec_ids.txt'], 15:12:11 INFO - 'tests': ['tcheck2']}, 15:12:11 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:12:11 INFO - '--tppagecycles', 15:12:11 INFO - '7'], 15:12:11 INFO - 'tests': ['tsvgm']}}, 15:12:11 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 15:12:11 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 15:12:11 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:12:11 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:12:11 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 15:12:11 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 15:12:11 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:12:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:12:11 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:12:11 INFO - 'talos_options': ['--e10s'], 15:12:11 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:12:11 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:12:11 INFO - 'tests': ['damp', 'tps']}, 15:12:11 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:12:11 INFO - 'talos_options': ['--e10s'], 15:12:11 INFO - 'tests': ['damp', 'tps']}, 15:12:11 INFO - 'g3': {'tests': ['dromaeo_dom']}, 15:12:11 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:12:11 INFO - 'other': {'tests': ['a11yr', 15:12:11 INFO - 'ts_paint', 15:12:11 INFO - 'tpaint', 15:12:11 INFO - 'sessionrestore', 15:12:11 INFO - 'sessionrestore_no_auto_restore']}, 15:12:11 INFO - 'other-e10s': {'talos_options': ['--e10s'], 15:12:11 INFO - 'tests': ['a11yr', 15:12:11 INFO - 'ts_paint', 15:12:11 INFO - 'tpaint', 15:12:11 INFO - 'sessionrestore', 15:12:11 INFO - 'sessionrestore_no_auto_restore']}, 15:12:11 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 15:12:11 INFO - 'tests': ['a11yr', 15:12:11 INFO - 'ts_paint', 15:12:11 INFO - 'tpaint', 15:12:11 INFO - 'sessionrestore', 15:12:11 INFO - 'sessionrestore_no_auto_restore']}, 15:12:11 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 15:12:11 INFO - 'tests': ['a11yr', 15:12:11 INFO - 'ts_paint', 15:12:11 INFO - 'tpaint', 15:12:11 INFO - 'sessionrestore', 15:12:11 INFO - 'sessionrestore_no_auto_restore']}, 15:12:11 INFO - 'other_l64': {'tests': ['a11yr', 15:12:11 INFO - 'ts_paint', 15:12:11 INFO - 'tpaint', 15:12:11 INFO - 'sessionrestore', 15:12:11 INFO - 'sessionrestore_no_auto_restore']}, 15:12:11 INFO - 'other_nol64': {'tests': ['a11yr', 15:12:11 INFO - 'ts_paint', 15:12:11 INFO - 'tpaint', 15:12:11 INFO - 'sessionrestore', 15:12:11 INFO - 'sessionrestore_no_auto_restore']}, 15:12:11 INFO - 'svgr': {'tests': ['tsvgx', 15:12:11 INFO - 'tsvgr_opacity', 15:12:11 INFO - 'tart', 15:12:11 INFO - 'tscrollx', 15:12:11 INFO - 'cart']}, 15:12:11 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 15:12:11 INFO - 'tests': ['tsvgx', 15:12:11 INFO - 'tsvgr_opacity', 15:12:11 INFO - 'tart', 15:12:11 INFO - 'tscrollx', 15:12:11 INFO - 'cart']}, 15:12:11 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:12:11 INFO - 'tests': ['tp5o']}, 15:12:11 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:12:11 INFO - 'talos_options': ['--e10s'], 15:12:11 INFO - 'tests': ['tp5o']}, 15:12:11 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:12:11 INFO - 'talos_options': ['--xperf_path', 15:12:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:12:11 INFO - 'tests': ['tp5n']}, 15:12:11 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:12:11 INFO - 'talos_options': ['--e10s', 15:12:11 INFO - '--xperf_path', 15:12:11 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:12:11 INFO - 'tests': ['tp5n']}}, 15:12:11 INFO - 'talos.zip': {'path': '', 15:12:11 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:12:11 INFO - Running post-action listener: _resource_record_post_action 15:12:11 INFO - ##### 15:12:11 INFO - ##### Running create-virtualenv step. 15:12:11 INFO - ##### 15:12:11 INFO - Running pre-action listener: _resource_record_pre_action 15:12:11 INFO - Running main action method: create_virtualenv 15:12:11 INFO - Creating virtualenv /builds/slave/test/build/venv 15:12:11 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 15:12:11 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:12:11 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:12:11 INFO - Using real prefix '/usr' 15:12:11 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:12:12 INFO - Installing distribute.............................................................................................................................................................................................done. 15:12:14 INFO - Installing pip.................done. 15:12:14 INFO - Return code: 0 15:12:14 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:12:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:12:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:12:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f821a4eec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25296c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25da900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2620b70>, '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 0x2671dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2672250>, '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': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', '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 15:12:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:12:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:12:14 INFO - Using env: {'DISPLAY': ':0', 15:12:14 INFO - 'HOME': '/home/cltbld', 15:12:14 INFO - 'LANG': 'en_US.UTF-8', 15:12:14 INFO - 'LANGUAGE': 'en_US:en', 15:12:14 INFO - 'LOGNAME': 'cltbld', 15:12:14 INFO - 'MAIL': '/var/mail/cltbld', 15:12:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:12:14 INFO - 'MOZ_NO_REMOTE': '1', 15:12:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:12:14 INFO - 'NO_EM_RESTART': '1', 15:12:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:12:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:12:14 INFO - 'PWD': '/builds/slave/test', 15:12:14 INFO - 'SHELL': '/bin/bash', 15:12:14 INFO - 'SHLVL': '1', 15:12:14 INFO - 'TERM': 'linux', 15:12:14 INFO - 'TMOUT': '86400', 15:12:14 INFO - 'USER': 'cltbld', 15:12:14 INFO - 'XDG_SESSION_COOKIE': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', 15:12:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:12:14 INFO - '_': '/tools/buildbot/bin/python'} 15:12:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:12:14 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 15:12:14 INFO - Cleaning up... 15:12:14 INFO - Return code: 0 15:12:14 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 15:12:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:12:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:12:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f821a4eec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25296c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25da900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2620b70>, '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 0x2671dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2672250>, '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': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', '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 15:12:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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>=0.7.1'] in /builds/slave/test/build 15:12:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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>=0.7.1 15:12:14 INFO - Using env: {'DISPLAY': ':0', 15:12:14 INFO - 'HOME': '/home/cltbld', 15:12:14 INFO - 'LANG': 'en_US.UTF-8', 15:12:14 INFO - 'LANGUAGE': 'en_US:en', 15:12:14 INFO - 'LOGNAME': 'cltbld', 15:12:14 INFO - 'MAIL': '/var/mail/cltbld', 15:12:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:12:14 INFO - 'MOZ_NO_REMOTE': '1', 15:12:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:12:14 INFO - 'NO_EM_RESTART': '1', 15:12:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:12:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:12:14 INFO - 'PWD': '/builds/slave/test', 15:12:14 INFO - 'SHELL': '/bin/bash', 15:12:14 INFO - 'SHLVL': '1', 15:12:14 INFO - 'TERM': 'linux', 15:12:14 INFO - 'TMOUT': '86400', 15:12:14 INFO - 'USER': 'cltbld', 15:12:14 INFO - 'XDG_SESSION_COOKIE': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', 15:12:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:12:14 INFO - '_': '/tools/buildbot/bin/python'} 15:12:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:12:14 INFO - Downloading/unpacking psutil>=0.7.1 15:12:14 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 15:12:14 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 15:12:14 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 15:12:14 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 15:12:14 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 15:12:14 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 15:12:16 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 15:12:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 15:12:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:12:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:12:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:12:16 INFO - Installing collected packages: psutil 15:12:16 INFO - Running setup.py install for psutil 15:12:16 INFO - building 'psutil._psutil_linux' extension 15:12:16 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 15:12:16 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 15:12:16 INFO - building 'psutil._psutil_posix' extension 15:12:16 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 15:12:16 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 15:12:16 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:12:16 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:12:16 INFO - Successfully installed psutil 15:12:16 INFO - Cleaning up... 15:12:16 INFO - Return code: 0 15:12:16 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 15:12:16 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')]} 15:12:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:12:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:16 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')]} 15:12:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:12:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f821a4eec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25296c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25da900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2620b70>, '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 0x2671dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2672250>, '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': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', '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 15:12:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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.0.0'] in /builds/slave/test/build 15:12:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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.0.0 15:12:16 INFO - Using env: {'DISPLAY': ':0', 15:12:16 INFO - 'HOME': '/home/cltbld', 15:12:16 INFO - 'LANG': 'en_US.UTF-8', 15:12:16 INFO - 'LANGUAGE': 'en_US:en', 15:12:16 INFO - 'LOGNAME': 'cltbld', 15:12:16 INFO - 'MAIL': '/var/mail/cltbld', 15:12:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:12:16 INFO - 'MOZ_NO_REMOTE': '1', 15:12:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:12:16 INFO - 'NO_EM_RESTART': '1', 15:12:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:12:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:12:16 INFO - 'PWD': '/builds/slave/test', 15:12:16 INFO - 'SHELL': '/bin/bash', 15:12:16 INFO - 'SHLVL': '1', 15:12:16 INFO - 'TERM': 'linux', 15:12:16 INFO - 'TMOUT': '86400', 15:12:16 INFO - 'USER': 'cltbld', 15:12:16 INFO - 'XDG_SESSION_COOKIE': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', 15:12:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:12:16 INFO - '_': '/tools/buildbot/bin/python'} 15:12:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:12:17 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 15:12:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:18 INFO - Downloading mozsystemmonitor-0.0.tar.gz 15:12:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 15:12:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:12:18 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 15:12:18 INFO - Installing collected packages: mozsystemmonitor 15:12:18 INFO - Running setup.py install for mozsystemmonitor 15:12:18 INFO - Successfully installed mozsystemmonitor 15:12:18 INFO - Cleaning up... 15:12:18 INFO - Return code: 0 15:12:18 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:12:18 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')]} 15:12:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:12:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:18 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')]} 15:12:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:12:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f821a4eec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25296c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25da900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2620b70>, '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 0x2671dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2672250>, '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': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', '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 15:12:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:12:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:12:18 INFO - Using env: {'DISPLAY': ':0', 15:12:18 INFO - 'HOME': '/home/cltbld', 15:12:18 INFO - 'LANG': 'en_US.UTF-8', 15:12:18 INFO - 'LANGUAGE': 'en_US:en', 15:12:18 INFO - 'LOGNAME': 'cltbld', 15:12:18 INFO - 'MAIL': '/var/mail/cltbld', 15:12:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:12:18 INFO - 'MOZ_NO_REMOTE': '1', 15:12:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:12:18 INFO - 'NO_EM_RESTART': '1', 15:12:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:12:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:12:18 INFO - 'PWD': '/builds/slave/test', 15:12:18 INFO - 'SHELL': '/bin/bash', 15:12:18 INFO - 'SHLVL': '1', 15:12:18 INFO - 'TERM': 'linux', 15:12:18 INFO - 'TMOUT': '86400', 15:12:18 INFO - 'USER': 'cltbld', 15:12:18 INFO - 'XDG_SESSION_COOKIE': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', 15:12:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:12:18 INFO - '_': '/tools/buildbot/bin/python'} 15:12:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:12:19 INFO - Downloading/unpacking blobuploader==1.2.4 15:12:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:20 INFO - Downloading blobuploader-1.2.4.tar.gz 15:12:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 15:12:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:12:20 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:12:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 15:12:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:12:21 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:12:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:21 INFO - Downloading docopt-0.6.1.tar.gz 15:12:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 15:12:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:12:21 INFO - Installing collected packages: blobuploader, requests, docopt 15:12:21 INFO - Running setup.py install for blobuploader 15:12:21 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:12:21 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:12:21 INFO - Running setup.py install for requests 15:12:21 INFO - Running setup.py install for docopt 15:12:22 INFO - Successfully installed blobuploader requests docopt 15:12:22 INFO - Cleaning up... 15:12:22 INFO - Return code: 0 15:12:22 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:12: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')]} 15:12:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:12:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12: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')]} 15:12:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:12:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f821a4eec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25296c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25da900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2620b70>, '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 0x2671dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2672250>, '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': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', '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 15:12:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:12:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --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 15:12:22 INFO - Using env: {'DISPLAY': ':0', 15:12:22 INFO - 'HOME': '/home/cltbld', 15:12:22 INFO - 'LANG': 'en_US.UTF-8', 15:12:22 INFO - 'LANGUAGE': 'en_US:en', 15:12:22 INFO - 'LOGNAME': 'cltbld', 15:12:22 INFO - 'MAIL': '/var/mail/cltbld', 15:12:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:12:22 INFO - 'MOZ_NO_REMOTE': '1', 15:12:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:12:22 INFO - 'NO_EM_RESTART': '1', 15:12:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:12:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:12:22 INFO - 'PWD': '/builds/slave/test', 15:12:22 INFO - 'SHELL': '/bin/bash', 15:12:22 INFO - 'SHLVL': '1', 15:12:22 INFO - 'TERM': 'linux', 15:12:22 INFO - 'TMOUT': '86400', 15:12:22 INFO - 'USER': 'cltbld', 15:12:22 INFO - 'XDG_SESSION_COOKIE': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', 15:12:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:12:22 INFO - '_': '/tools/buildbot/bin/python'} 15:12:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:12:22 INFO - Running setup.py (path:/tmp/pip-6rzgWx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:12:22 INFO - Running setup.py (path:/tmp/pip-teISoo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:12:22 INFO - Running setup.py (path:/tmp/pip-Ezw6wJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:12:22 INFO - Running setup.py (path:/tmp/pip-2zDcx0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:12:22 INFO - Running setup.py (path:/tmp/pip-Rq3ZlH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:12:22 INFO - Running setup.py (path:/tmp/pip-c7zeiN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:12:22 INFO - Running setup.py (path:/tmp/pip-DAvP0H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:12:22 INFO - Running setup.py (path:/tmp/pip-pDXdJ6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:12:22 INFO - Running setup.py (path:/tmp/pip-niRmGU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:12:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:12:22 INFO - Running setup.py (path:/tmp/pip-JrEoav-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:12:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:12:23 INFO - Running setup.py (path:/tmp/pip-xfyngF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:12:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:12:23 INFO - Running setup.py (path:/tmp/pip-zYf8OB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:12:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:12:23 INFO - Running setup.py (path:/tmp/pip-xEl5Pv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:12:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:12:23 INFO - Running setup.py (path:/tmp/pip-Ope_3O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:12:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:12:23 INFO - Running setup.py (path:/tmp/pip-FCPrQJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:12:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:12:23 INFO - Running setup.py (path:/tmp/pip-va8N8w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:12:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:12:23 INFO - Running setup.py (path:/tmp/pip-PU0Iih-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:12:23 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:12:23 INFO - Running setup.py install for manifestparser 15:12:23 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:12:23 INFO - Running setup.py install for mozcrash 15:12:23 INFO - Running setup.py install for mozdebug 15:12:23 INFO - Running setup.py install for mozdevice 15:12:23 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:12:23 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:12:23 INFO - Running setup.py install for mozfile 15:12:24 INFO - Running setup.py install for mozhttpd 15:12:24 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Running setup.py install for mozinfo 15:12:24 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Running setup.py install for mozInstall 15:12:24 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Running setup.py install for mozleak 15:12:24 INFO - Running setup.py install for mozlog 15:12:24 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Running setup.py install for moznetwork 15:12:24 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Running setup.py install for mozprocess 15:12:24 INFO - Running setup.py install for mozprofile 15:12:24 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Running setup.py install for mozrunner 15:12:24 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:12:24 INFO - Running setup.py install for mozscreenshot 15:12:25 INFO - Running setup.py install for moztest 15:12:25 INFO - Running setup.py install for mozversion 15:12:25 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:12:25 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:12:25 INFO - Cleaning up... 15:12:25 INFO - Return code: 0 15:12:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:12:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:12:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:12:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:25 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f821a4eec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25296c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25da900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2620b70>, '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 0x2671dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2672250>, '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': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', '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 15:12:25 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:12:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:12:25 INFO - Using env: {'DISPLAY': ':0', 15:12:25 INFO - 'HOME': '/home/cltbld', 15:12:25 INFO - 'LANG': 'en_US.UTF-8', 15:12:25 INFO - 'LANGUAGE': 'en_US:en', 15:12:25 INFO - 'LOGNAME': 'cltbld', 15:12:25 INFO - 'MAIL': '/var/mail/cltbld', 15:12:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:12:25 INFO - 'MOZ_NO_REMOTE': '1', 15:12:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:12:25 INFO - 'NO_EM_RESTART': '1', 15:12:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:12:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:12:25 INFO - 'PWD': '/builds/slave/test', 15:12:25 INFO - 'SHELL': '/bin/bash', 15:12:25 INFO - 'SHLVL': '1', 15:12:25 INFO - 'TERM': 'linux', 15:12:25 INFO - 'TMOUT': '86400', 15:12:25 INFO - 'USER': 'cltbld', 15:12:25 INFO - 'XDG_SESSION_COOKIE': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', 15:12:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:12:25 INFO - '_': '/tools/buildbot/bin/python'} 15:12:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:12:25 INFO - Running setup.py (path:/tmp/pip-paJjW6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:12:25 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)) 15:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:12:25 INFO - Running setup.py (path:/tmp/pip-PPhn5P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:12:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 15:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:12:25 INFO - Running setup.py (path:/tmp/pip-4RHxpI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:12:25 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)) 15:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:12:25 INFO - Running setup.py (path:/tmp/pip-BxTPXH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:12:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 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)) 15:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:12:25 INFO - Running setup.py (path:/tmp/pip-csigY6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:12:25 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)) 15:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:12:25 INFO - Running setup.py (path:/tmp/pip-XTzS73-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:12:25 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)) 15:12:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:12:25 INFO - Running setup.py (path:/tmp/pip-DJYOW_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:12:26 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:12:26 INFO - Running setup.py (path:/tmp/pip-u2yLvY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:12:26 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:12:26 INFO - Running setup.py (path:/tmp/pip-LOpGqx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:12:26 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:12:26 INFO - Running setup.py (path:/tmp/pip-Rt8Sm9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:12:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:12:26 INFO - Running setup.py (path:/tmp/pip-dv1GLw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:12:26 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:12:26 INFO - Running setup.py (path:/tmp/pip-AKt5mN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:12:26 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:12:26 INFO - Running setup.py (path:/tmp/pip-PHDOiy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:12:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:12:26 INFO - Running setup.py (path:/tmp/pip-kUfigv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:12:26 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:12:26 INFO - Running setup.py (path:/tmp/pip-l5ZpDa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:12:26 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:12:26 INFO - Running setup.py (path:/tmp/pip-s1q4i3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:12:26 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)) 15:12:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:12:26 INFO - Running setup.py (path:/tmp/pip-QMsNh4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:12:26 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)) 15:12:26 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:12:26 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.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 15:12:26 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)) 15:12:26 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:12:26 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.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 15:12:26 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:12:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:26 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:26 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 15:12:26 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:12:26 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:12:28 INFO - Downloading blessings-1.5.1.tar.gz 15:12:28 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 15:12:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:12:28 INFO - Installing collected packages: blessings 15:12:28 INFO - Running setup.py install for blessings 15:12:28 INFO - Successfully installed blessings 15:12:28 INFO - Cleaning up... 15:12:28 INFO - Return code: 0 15:12:28 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:12:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:12:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:12:28 INFO - Reading from file tmpfile_stdout 15:12:28 INFO - Current package versions: 15:12:28 INFO - argparse == 1.2.1 15:12:28 INFO - blessings == 1.5.1 15:12:28 INFO - blobuploader == 1.2.4 15:12:28 INFO - docopt == 0.6.1 15:12:28 INFO - manifestparser == 1.1 15:12:28 INFO - mozInstall == 1.12 15:12:28 INFO - mozcrash == 0.16 15:12:28 INFO - mozdebug == 0.1 15:12:28 INFO - mozdevice == 0.47 15:12:28 INFO - mozfile == 1.2 15:12:28 INFO - mozhttpd == 0.7 15:12:28 INFO - mozinfo == 0.9 15:12:28 INFO - mozleak == 0.1 15:12:28 INFO - mozlog == 3.0 15:12:28 INFO - moznetwork == 0.27 15:12:28 INFO - mozprocess == 0.22 15:12:28 INFO - mozprofile == 0.27 15:12:28 INFO - mozrunner == 6.11 15:12:28 INFO - mozscreenshot == 0.1 15:12:28 INFO - mozsystemmonitor == 0.0 15:12:28 INFO - moztest == 0.7 15:12:28 INFO - mozversion == 1.4 15:12:28 INFO - psutil == 3.1.1 15:12:28 INFO - requests == 1.2.3 15:12:28 INFO - wsgiref == 0.1.2 15:12:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:12:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:12:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:12:28 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f821a4eec70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x25296c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x25da900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2620b70>, '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 0x2671dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2672250>, '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': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', '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 15:12:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 15:12:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 15:12:28 INFO - Using env: {'DISPLAY': ':0', 15:12:28 INFO - 'HOME': '/home/cltbld', 15:12:28 INFO - 'LANG': 'en_US.UTF-8', 15:12:28 INFO - 'LANGUAGE': 'en_US:en', 15:12:28 INFO - 'LOGNAME': 'cltbld', 15:12:28 INFO - 'MAIL': '/var/mail/cltbld', 15:12:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:12:28 INFO - 'MOZ_NO_REMOTE': '1', 15:12:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:12:28 INFO - 'NO_EM_RESTART': '1', 15:12:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:12:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:12:28 INFO - 'PWD': '/builds/slave/test', 15:12:28 INFO - 'SHELL': '/bin/bash', 15:12:28 INFO - 'SHLVL': '1', 15:12:28 INFO - 'TERM': 'linux', 15:12:28 INFO - 'TMOUT': '86400', 15:12:28 INFO - 'USER': 'cltbld', 15:12:28 INFO - 'XDG_SESSION_COOKIE': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', 15:12:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:12:28 INFO - '_': '/tools/buildbot/bin/python'} 15:12:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:12:29 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 1)) 15:12:29 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 2)) 15:12:29 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 3)) 15:12:29 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 4)) 15:12:29 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 5)) 15:12:29 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 6)) 15:12:29 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 7)) 15:12:29 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 8)) 15:12:29 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.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:12:29 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 3)) 15:12:29 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.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 15:12:29 INFO - Cleaning up... 15:12:29 INFO - Return code: 0 15:12:29 INFO - Running post-action listener: _resource_record_post_action 15:12:29 INFO - Running post-action listener: _start_resource_monitoring 15:12:29 INFO - Starting resource monitoring. 15:12:29 INFO - ##### 15:12:29 INFO - ##### Running install step. 15:12:29 INFO - ##### 15:12:29 INFO - Running pre-action listener: _resource_record_pre_action 15:12:29 INFO - Running main action method: install 15:12:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:12:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:12:29 INFO - Reading from file tmpfile_stdout 15:12:29 INFO - Detecting whether we're running mozinstall >=1.0... 15:12:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:12:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:12:29 INFO - Reading from file tmpfile_stdout 15:12:29 INFO - Output received: 15:12:29 INFO - Usage: mozinstall [options] installer 15:12:29 INFO - Options: 15:12:29 INFO - -h, --help show this help message and exit 15:12:29 INFO - -d DEST, --destination=DEST 15:12:29 INFO - Directory to install application into. [default: 15:12:29 INFO - "/builds/slave/test"] 15:12:29 INFO - --app=APP Application being installed. [default: firefox] 15:12:29 INFO - mkdir: /builds/slave/test/build/application 15:12:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 15:12:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 15:12:43 INFO - Reading from file tmpfile_stdout 15:12:43 INFO - Output received: 15:12:43 INFO - /builds/slave/test/build/application/firefox/firefox 15:12:43 INFO - Running post-action listener: _resource_record_post_action 15:12:43 INFO - ##### 15:12:43 INFO - ##### Running run-tests step. 15:12:43 INFO - ##### 15:12:43 INFO - Running pre-action listener: _resource_record_pre_action 15:12:43 INFO - Running main action method: run_tests 15:12:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:12:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:12:43 INFO - Python 2.7.3 15:12:43 INFO - Return code: 0 15:12:43 INFO - grabbing minidump binary from tooltool 15:12:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 15:12:43 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2620b70>, '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 0x2671dc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2672250>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:12:43 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 15:12:43 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 15:12:43 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:12:43 INFO - Return code: 0 15:12:43 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 15:12:43 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:12:43 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:12:43 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 15:12:43 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:12:43 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-037', '--webServer', 'localhost'] in /builds/slave/test/build 15:12:43 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-037 --webServer localhost 15:12:43 INFO - Using env: {'DISPLAY': ':0', 15:12:43 INFO - 'HOME': '/home/cltbld', 15:12:43 INFO - 'LANG': 'en_US.UTF-8', 15:12:43 INFO - 'LANGUAGE': 'en_US:en', 15:12:43 INFO - 'LOGNAME': 'cltbld', 15:12:43 INFO - 'MAIL': '/var/mail/cltbld', 15:12:43 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:12:43 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:12:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:12:43 INFO - 'MOZ_NO_REMOTE': '1', 15:12:43 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:12:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:12:43 INFO - 'NO_EM_RESTART': '1', 15:12:43 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:12:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:12:43 INFO - 'PWD': '/builds/slave/test', 15:12:43 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:12:43 INFO - 'SHELL': '/bin/bash', 15:12:43 INFO - 'SHLVL': '1', 15:12:43 INFO - 'TERM': 'linux', 15:12:43 INFO - 'TMOUT': '86400', 15:12:43 INFO - 'USER': 'cltbld', 15:12:43 INFO - 'XDG_SESSION_COOKIE': '6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951', 15:12:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:12:43 INFO - '_': '/tools/buildbot/bin/python'} 15:12:43 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-037', '--webServer', 'localhost'] with output_timeout 3600 15:12:43 INFO - mozversion INFO | application_buildid: 20151119135314 15:12:43 INFO - mozversion INFO | application_changeset: 0c351448cd9f4224bf98709d04e6623b52eef8b0 15:12:43 INFO - mozversion INFO | application_display_name: Nightly 15:12:43 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:12:43 INFO - mozversion INFO | application_name: Firefox 15:12:43 INFO - mozversion INFO | application_remotingname: firefox 15:12:43 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 15:12:43 INFO - mozversion INFO | application_vendor: Mozilla 15:12:43 INFO - mozversion INFO | application_version: 45.0a1 15:12:43 INFO - mozversion INFO | platform_buildid: 20151119135314 15:12:43 INFO - mozversion INFO | platform_changeset: 0c351448cd9f4224bf98709d04e6623b52eef8b0 15:12:43 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 15:12:43 INFO - mozversion INFO | platform_version: 45.0a1 15:12:43 INFO - 2015-11-19 15:12:43,756 DEBUG : using testdate: 1447974763 15:12:43 INFO - 2015-11-19 15:12:43,756 DEBUG : actual date: 1447974763 15:12:43 INFO - 2015-11-19 15:12:43,764 INFO : starting webserver on 'localhost:52126' 15:12:43 INFO - 2015-11-19 15:12:43,765 INFO : Starting test suite talos-linux64-ix-037 15:12:43 INFO - 2015-11-19 15:12:43,765 INFO : Starting test dromaeo_css 15:12:43 INFO - 2015-11-19 15:12:43,765 DEBUG : operating with platform_type : linux_ 15:12:43 INFO - 2015-11-19 15:12:43,766 INFO : Initialising browser for dromaeo_css test... 15:12:43 INFO - 2015-11-19 15:12:43,782 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmphWY1kC/profile http://localhost:52126/getInfo.html 15:12:48 INFO - 2015-11-19 15:12:48,093 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 15:12:48 INFO - 2015-11-19 15:12:48,093 DEBUG : BROWSER_OUTPUT: colorDepth:24 15:12:48 INFO - 2015-11-19 15:12:48,094 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 15:12:48 INFO - 2015-11-19 15:12:48,094 DEBUG : BROWSER_OUTPUT: __metrics 15:12:48 INFO - 2015-11-19 15:12:48,202 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:12:49 INFO - 2015-11-19 15:12:49,503 INFO : Browser initialized. 15:12:49 INFO - 2015-11-19 15:12:49,503 INFO : Running cycle 1/1 for dromaeo_css test... 15:12:49 INFO - 2015-11-19 15:12:49,504 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmphWY1kC/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 15:13:01 INFO - 2015-11-19 15:13:01,469 DEBUG : BROWSER_OUTPUT: RSS: Main: 141336576 15:13:01 INFO - 2015-11-19 15:13:01,470 DEBUG : BROWSER_OUTPUT: 15:13:53 INFO - 2015-11-19 15:13:53,006 DEBUG : BROWSER_OUTPUT: 1447974833004 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] 15:16:05 INFO - 2015-11-19 15:16:05,426 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/dromaeo/cssquery-dojo.html (next: http://localhost:52126/tests/dromaeo/cssquery-ext.html) 15:16:06 INFO - 2015-11-19 15:16:06,857 DEBUG : BROWSER_OUTPUT: RSS: Main: 283279360 15:16:06 INFO - 2015-11-19 15:16:06,857 DEBUG : BROWSER_OUTPUT: 15:19:09 INFO - 2015-11-19 15:19:09,351 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/dromaeo/cssquery-ext.html (next: http://localhost:52126/tests/dromaeo/cssquery-jquery.html) 15:19:09 INFO - 2015-11-19 15:19:09,917 DEBUG : BROWSER_OUTPUT: RSS: Main: 221560832 15:19:09 INFO - 2015-11-19 15:19:09,917 DEBUG : BROWSER_OUTPUT: 15:22:11 INFO - 2015-11-19 15:22:11,973 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/dromaeo/cssquery-jquery.html (next: http://localhost:52126/tests/dromaeo/cssquery-mootools.html) 15:22:12 INFO - 2015-11-19 15:22:12,539 DEBUG : BROWSER_OUTPUT: RSS: Main: 216715264 15:22:12 INFO - 2015-11-19 15:22:12,539 DEBUG : BROWSER_OUTPUT: 15:25:14 INFO - 2015-11-19 15:25:14,453 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/dromaeo/cssquery-mootools.html (next: http://localhost:52126/tests/dromaeo/cssquery-prototype.html) 15:25:15 INFO - 2015-11-19 15:25:15,027 DEBUG : BROWSER_OUTPUT: RSS: Main: 201936896 15:25:15 INFO - 2015-11-19 15:25:15,027 DEBUG : BROWSER_OUTPUT: 15:28:17 INFO - 2015-11-19 15:28:17,785 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/dromaeo/cssquery-prototype.html (next: http://localhost:52126/tests/dromaeo/cssquery-yui.html) 15:28:18 INFO - 2015-11-19 15:28:18,367 DEBUG : BROWSER_OUTPUT: RSS: Main: 203603968 15:28:18 INFO - 2015-11-19 15:28:18,367 DEBUG : BROWSER_OUTPUT: 15:31:20 INFO - 2015-11-19 15:31:20,880 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/dromaeo/cssquery-yui.html (next: http://localhost:52126/tests/dromaeo/cssquery-dojo.html) 15:31:21 INFO - 2015-11-19 15:31:21,131 DEBUG : BROWSER_OUTPUT: RSS: Main: 250716160 15:31:21 INFO - 2015-11-19 15:31:21,131 DEBUG : BROWSER_OUTPUT: 15:31:21 INFO - 2015-11-19 15:31:21,131 DEBUG : BROWSER_OUTPUT: __start_tp_report 15:31:21 INFO - 2015-11-19 15:31:21,131 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 15:31:21 INFO - 2015-11-19 15:31:21,132 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 15:31:21 INFO - 2015-11-19 15:31:21,132 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 15:31:21 INFO - 2015-11-19 15:31:21,132 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2680.2495301315635;2794.776417886569;2796.9021084262054;2808.8174268672533;2819.1119797263855;4680.157571637104;4801.4718380978065;4830.855074347775;4854.101991131643;4905.8528244152685;4640.1879671057595;4770.427548694153;4773.594244489213;4785.832495862645;4789.640776941726;4281.46481689788;4352.521222665504;4359.346098085297;4403.3174857897075;4438.423005009345;4445.488768791598;4469.351943968123;4488.0799436115685;4499;4510.075434535912;4327.653787696977;4441.9111617767785;4495.303227999665;4499.6850220484575;4571.885702857438;4357.4988876279;4359.476862776487;4362.171187474401;4366.8253269869165;4368.825246990116;4338.002259480306;4341.978290108561;4350.216960947028;4354.238008348558;4357.825686972517;4618.699784513996;4635.745034023127;4654.4647365553055;4659.79030943605;4676.438827340707;5113.181890897476;5193.662411943249;5216.26972223889;5218.1129208034345;5222.556082732972;5211.42674305826;5217.34783152106;5241.056609810233;5245.344331958505;5298.602604804617;4646.070785842845;4704.223803072523;4729.62163026957;4778.761061946889;4820.6143508519235;5279.841604751864;5314.5216930476445;5321.494458026481;5321.680699158062;5325.094733895247;5044.873878153076;5081.7713202905215;5095.770690318945;5097.847064588068;5139.691618502902;4956.256561515729;5007.223880298559;5149.382074151051;5152.871178220499;5173.948260517422;5052;5126.564242039394;5146.742662866842;5147.124988751922;5155.38135423744;5100.668456550312;5124.8206312778875;5136.306598609214;5138.254953031789;5175.767090480862;4037.717359784787;4125.855595054219;4132.648724858421;4278.443802305743;4328.220920234388;3656.469811877263;3704.481372607837;3741.2704522618374;3749.4375843623675;3751.1934933989323;4405.427294451701;4434.7117437367115;4434.955650443454;4438.933415998763;4473.172463094338;4925.13810083234;5199.2201169824075;5201.739913004335;5202.2456743771945;5203.895922081537;4256.978715106405;4284;4294.527601963781;4296.849610263688;4338.197433474817;4574.130915126116;4579.129965306581;4581.152486789954;4582.541745825458;4633.606143477775;4580.839670611513;4894.363732714724;4894.706317620812;4915.066137433948;4977.178765503724;5026.070177017264;5054.4187418447345;5083.72039537829;5230.476952304892;5235.60732945023;4868.586170175433;4875.488073752347;4875.634327425386;4907.852764417074;4920.434150072788;5057.797688092435;5057.924131138109;5058.064258112261;5063.468335824686;5096.388433388017;4908.067467181224;5016.448190698947;5026.5727413168825;5132.820351287687;5138.152204886152;4870.196417591058;4894.045661096052;4959.776810043484;5002.299678045149;5010.423801262756;5013.047520971004;5034.899302013866;5035.219540971156;5037.017781532566;5084.186530155305;4587.977060114678;4945.826896058621;4950.6782059166035;4952.826651067339;4962.156433406401;4995.350604421402;5016.924746128884;5018.222175562793;5019.498050194951;5025.195968644999;4811.927821082757;4876.244182151772;4877.756112194447;4905.1416002200185;4943.555080042814 15:31:21 INFO - 2015-11-19 15:31:21,133 DEBUG : BROWSER_OUTPUT: |1;ext.html;574.84191847242;575.0913556580603;580.579080166879;581.226968132384;593.0836857055848;28071.578926316095;28553.714462855365;28616.28459288519;28620.85689571552;28653.713462865366;29169.56245656317;36699.431039827155;37274.254514909684;37453;37580.24839503208;7771.766846994599;7896.052473703164;7901.604919754018;7913.841723165533;7917.208279172094;7120.85758284834;7308.4518661100365;7785.299323060924;7888.684452621888;7888.960555197216;10155.492225388738;10396.42819644923;10399.168066554657;10400.37597744134;10404.89595104047;9955.10404063634;9999.250056245774;10050.396976181453;10086.344387614781;10089;9875.111239988435;10027;10046.346987445793;10050.09549140581;10056.94971525145;38530.229395412214;38982.80508597467;39032.60967390318;39059.804700976594;39170.804145979375;3032.408680307341;3075.2773098321877;3142.308692087737;3586.1751797086554;3638.6179451157777;27250.863745681145;27744.30639234015;27780;28034;28109.92406101104;3490.2844916791996;3505.3164632896596;3520.718342532617;3543.574771027493;3600.9279814403567;218740;220540.8972955141;221292;221466;222376;49042.50957490451;50033.749831250614;57049;57586.42413575894;60433.09350359748;55871.44128558744;55949.720251399296;56167.91076490751;56226.71886640623;56275.15587266194;14499;14586.927065364818;14659;14673.85326146725;14691.926540367229;11417.543298268143;11505.597304094317;11507.02190313816;11509.366984815915;11517.308961462339;18900.71648925267;19109.235630574898;19154;19158.425247242605;19181.32865349706;7576.128745194374;7807.453478256582;7839.568823714751;7896.249856263646;7918.841623167505;884.8097659003345;902.5397047505688;915.5285028210477;984.3257368702461;1050.7320633238476;27215.319617009733;30190.245243869078;31266.374672506423;31275.687243127733;31656.208594785316;899.6356475627381;958.6644674363916;1020.7193021919031;1051.3376572759266;1067.066316972649;13632;13830.515931942333;13886.86113138876;13901.860981390057;13973.720525589431;316218.02691838105;321815;322423;322488;324110;45411.545884541396;45890.770546147054;45913.770431147634;45941;45975.31037034447;1194.1581185264367;1197.0483465644834;1205.6503613951857;1206.8129439936824;1210.6247063410372;23051.6542251863;30166.396672066876;30560.541591876583;30657.540136897518;30677.661169415293;43501.3474797872;43980.560194398924;44073;44107.77946110249;44122.558774411846;243414;244924;245514;246007;246976;24166.87916560406;24777.380565485288;29907.850460747555;30262.69737302687;30692.693073068982;35659;36542.45186322154;36715.81642091773;36938;37244.627553724116;29783.404331913673;29914.850425747733;31357;31777;31852.5222121673;32474.35051299008;32576.51135232926;32861.83569082139;37552.81223593974;39358.212835743696;33524.83237583796;34163.316733665684;34276.48585271273;34349.65650343464;34405.82797085999;28783.712162878102;29895.252618684706;30456.086317410514;30559.2360190997;30568.694313056585;23597.29208123759;23665.171718989754;24008;24045.879770601736;24067.638985415582 15:31:21 INFO - 2015-11-19 15:31:21,137 DEBUG : BROWSER_OUTPUT: |2;jquery.html;322.20094166467146;322.4502223708577;325.347677905799;343.8985499277713;345.65779877920863;12310.384480775947;12773.808392874114;14837;15436.61408464789;15712.45006424774;14956.401743930257;15348.10598899513;16012.759808602881;16233.918830405832;16263.51209463715;4894.3147959285725;4951.801927922878;5119.7952081916865;5123.4108077571;5125.948740512603;3616.945745813815;3730.477733117366;3733.4026555751084;3734.3278209922205;5073.898522029557;3706.592274849764;5513.393526712059;5688.2605261315975;5694.544436445074;5699.658020518761;5507.504324610784;5641.68970706613;5654.010548154057;5670.574706896958;5673.149027645845;5095.414027386824;5112.59099272061;5114.053900028507;5116.283720279164;5117.104506711348;18987.43037708871;19297.131629076586;19507.609847802963;19558.413247602595;19633.31283405074;1856.907154642276;1933.5939452714947;1939.4084804134734;2045.8261047810954;2078.532330225702;12438.253704777651;12669.239845609292;12768.170068945488;12835;13068.934655326757;1698.269744010075;1723.6121872578694;1730.809610942808;1761.181050811366;1804.124999375302;50682;51722;53960;54659.72670136624;55475.44524554743;8476.576171191417;8965.910340896507;9775.560099795384;9848;9856.211503079736;12466.065045121652;12466.314352710688;12475.189112707645;12483.06377021727;12488.875111248954;6870.45036397087;6877.58734475933;6885.449164066863;6911.343422374866;6960.060391847036;6465;6506.479481641457;6516.6415847128865;6551.967240163769;6562.934370656328;3753.849846006129;3788.261289048609;3788.962110378916;4113.753174809521;4213.073123912795;1555.1058141568644;1604.1017030462979;1610.549046267047;1691.8223586523484;1736.5658585353663;838.9244967952792;863.4905405810601;913.3743385780629;925.6112432778249;939.262678797141;15137.243137843285;15743.13412762309;16133.112678802778;16398.918005409898;16472.588185295223;775.464929198851;828.0849661124371;874.2306770042322;885.6944354197921;934.3226161033197;8953.373263871466;9079.863802042975;9130.223930965942;9225.07749225072;9337.486438245825;471140;476913;495598;497160;500152;70769.64615176892;71125.64437177885;72546.63726681333;72795.63602181955;73189.63405183046;1101.8347247912716;1102.3606308341143;1107.6621630402644;1118.1725523112839;1119.4738472917716;14818.333175007367;14976.101433914;15072.321745521696;15072.54782356531;15330.156841373831;32143.35713285768;32147.839260803546;32524.67475325311;32643.673563264063;32952.67047329496;42149.789251053546;42845.78577107094;42921;43275;46672.533274668174;8989.910100898907;9115;9242;9245.445273283625;9354.859677104985;16227.107509086642;16492.42276520316;16544.66910661804;16617.50147495577;16844.07357595295;13251;13392.799108013582;13832.86167138356;14089.506867260006;14234.928825355806;12394.442250098587;12475.438605262967;13638.863611363759;13784.724305513633;13876.375563099482;10124.84812727795;12660.873391266337;12937.417816198482;13138.605841824761;13635.113717608323;8757.47455152693;8878.334124940526;8982.910170898207;8990.415622984485;9008.684696035607;12106.334151621746;12290.877091228973;12414.317212553397;13092.14901031468;13419.530316438877 15:31:21 INFO - 2015-11-19 15:31:21,138 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1462.9634259143513;1654.437491252974;1668.3076523242855;1723.6816481831931;1730.9307627694889;6153;6805.897911531331;6924.446044316455;6934.341237582435;6940.479464040204;7118.2881711828795;7224.783256502314;7232.7830165095;7241.710331586743;7262.20115787263;1748.4754573627924;1777.395685466941;2029.3708950225441;2057.989710051455;2082.2920207129573;2111.3032699209302;2117.8623389479712;2120.4380839077658;2122.066290832037;2129.606022885763;2036.9898150509227;2082.1255072869358;2107.104480595741;2113.894305284737;2114.513661857766;1755.991220043898;1811.0763510609552;2019.0611365714867;2070.0477780221117;2074.025208152166;2110.6728457089175;2115.1962254343252;2133.7332833395826;2135.530183359658;2135.690324902896;7244.8551028979655;7277.8544429111125;7299.051123353983;7299.89050164248;7306.744263950789;4321.67587430944;4401.713888597263;4409.955900440987;4432.3794668746405;4433.334999750031;2833.6741274753463;2845.132234668425;2884.7403733664073;2890.075175943678;2994.1766014346013;876.9693060742843;896.3277541843618;921.4655499810161;925.3522534226001;1695.2117265471616;9556;9572.090651388176;9614.951925240399;9622.085901839315;9633.855492167622;3948.2103579284258;4011.4584531088512;4046.7252815363067;4054.8175332110127;4098.077932465171;8080.111187769341;8085.595720213966;8112.513249205066;8116.513009219466;8136.918630813616;4372.1692878353015;4387.802548885308;4441.244988351923;4442.044960333479;4445.799939002753;4068.613481719232;4080.6327430531396;4083.0404854859084;4086.734362266443;4087.816048277835;3164.7784655074383;3195.185227766951;3215.93874021577;3242.302904875416;3246.577944867199;961.8461046232709;981.9116279534733;985.1527686189871;985.6845809341086;994.2791476179856;1132.7621199548023;1143.7998350288667;1152.4295473740385;1158.5134243617701;1161.4831400026908;6725.2602213756445;6752.864942701119;6753.45972322213;6764.594124352555;6799.354061364163;443.864621290503;454.79534209605146;455.0285141223446;457.61331674734794;463.4276668314629;5370.892582148335;5424.105022671294;5426.050441172779;5427.402985671573;5432.538234250054;8528.65885364591;8655.740327790176;8656.78358041054;8684.956575217084;8904.59929303183;7984.40116991228;8047.718329858427;8117.188281171953;8120.3503719702285;8135.023797144262;6797.116374871235;6817.488688348394;6888.41448476885;6936.514443988873;6943.132108486439;6871.896921546281;6939.375456208763;6960.37356637905;6965.373116419547;6968.014115976922;7747.767566973;7878.684852605831;7908.84182316362;8025.317847982987;8026.638801253841;8014.479058861155;8030.478018928751;8098.83802323962;8238.052623948322;8247.134050924567;6220.782272620437;6241.96879015602;6319.778807741707;6332.176817013758;6495.253045899593;6845.212800528003;6873.621950792754;7012.544184627983;7027.086478757728;7069.823254418475;6427.1002059710745;6469.320721324193;6595.769148079794;6669.899951500634;6760;5623.297087864017;6306.716197771019;6360.745570177141;6445.484361250995;6486.4486518646445;6346.333634968262;6386.712597933197;6391.265004524539;6392.0731493934045;6405.103285540122;5385.27298814655;5433.483819037185;5434.972825135849;5442.319710036246;5443.727813609383;6160.13758073861;6188.845278868064;6195.907061393992;6196.566240363131;6196.876062478816 15:31:21 INFO - 2015-11-19 15:31:21,140 DEBUG : BROWSER_OUTPUT: |4;prototype.html;312.5296428874544;313.17322269209285;323.0470113166159;327.04176762087104;327.48421236552434;5362.008028514728;5425.7287135643255;5471.234027236185;5504.779808807642;5505.449455054492;5387.488188622085;5410.675359478434;5414.972925135378;5415.323084614423;5415.350157981048;4003.799810009488;4108.712390132692;4126.5254495732925;4208.936865947013;4212.7472351659;4210.789460526977;4217.599328063829;4242.766647834368;4250.511191213003;4252.468441444819;4185.832566697329;4197.286461301586;4203.97002734329;4211.789410529476;4214.36784482327;3985.9601403986026;4086.1010577672864;4103.958960410402;4158.08522125132;4213.30480470722;3720.8325625346924;3728.9627103728885;3729.4778730977687;3738.327101121797;3740.4576336431337;5168.586513078944;5182.404023537266;5184.429712731597;5187.533122019036;5189.273501709764;4868.391451068616;4869.756512174413;4872.293517439952;4874.585660218886;4877.951220487821;5553.389517040094;5644.153376993443;5682.090865461506;5690.317161940594;5698.6865722385255;4039.8586049488126;4044.5955404459614;4044.858429954967;4045.41341505483;4051.4733084699096;5969.940300596982;5973.342932277446;5977.521798256173;5983;5984.551158663117;4152.584741525823;4161.979190104091;4163.188178305262;4164.937525937114;4165.500139983161;4004.2992476316526;4125.030617804813;4128.649064829463;4131.690123240769;4211.052513184509;4715.882102947385;4757.215059515211;4786.569208771228;4787.8563643090765;4790.592799612072;5681.0910254359105;5684.403137670568;5698.2592263005545;5708.229389032511;5709.600327977002;1443.949461768854;1472.1829384691384;1473.690524989764;1473.9705205895823;1474.0492382413497;962.2013728605241;970.7219316682034;991.9305648604528;991.9950400247952;1000.6997900629782;4945.109880221595;4945.703257804544;4951.183054795918;4952.108620448282;4953.331300274489;5881.088431293157;5888.646681199141;5895.616784908967;5896.3219229788265;5898.203742494708;4933.45731969483;4938.802447902043;4943.431505376856;4945.23348880924;4952.331435256195;3006.2784931616256;3059.2657762137374;3068.969310306913;3121.843907804601;3156.2425017995974;5535.169724541351;5616.157576363578;5616.606837521416;5632.802851900164;5640.407757185437;6107.389261073857;6109.358517355702;6115.113308570321;6116.510679145657;6117.082437634391;5615.8876822464135;5621.971890140523;5624.987502249634;5625.409332020243;5625.493705566519;5752.827415177551;5923.289205295392;5931.495822854933;5931.911021334769;5934.554908381802;5820.883582328414;5822.475977162076;5824.94175058244;5825.417458254141;5828.154917537018;5604.159376093456;5613.635113717595;5615.691136987505;5620.100783874561;5623.746931388016;3992.401139829049;4104.138130992525;4107.199096176337;4111.938320925248;4128.195001974706;5916.3492015877355;5924.585279030426;5931.940680593311;5936.762529498945;5938.376470470538;5676.68778217202;5693.117566777156;5693.914591281217;5694.487496125203;5695.487406133468;5536.474034966672;5681.926096974492;5685.090385538294;5686.289213848269;5689.630174038674;5541.418151094238;5560.805371811967;5563.248961390161;5580.358258800127;5586;5735.025045742317;5751.568632352674;5751.654900705971;5757.050086735641;5760.740766665594;5384.730763461889;5483.698396588226;5490.972545137249;5492.917606235989;5501.779928802803 15:31:21 INFO - 2015-11-19 15:31:21,143 DEBUG : BROWSER_OUTPUT: |5;yui.html;678.8710145072439;692.8822100242959;766.5285849202738;780.3172224303738;801.2108073547556;11344.546218151274;11524.020458261037;11567.768644627102;11736.882631173687;11791.941040294809;10575.36547807132;11580.942095289533;12190.146689731722;12194.085443591744;12203.084768642366;599.5802937943424;775.2906090926796;788.3496115704538;789.1950210784996;789.5183937797939;779.6959185917468;794.3486341200218;795.2842441802367;795.2882170457437;795.5862951265339;638.955273130881;644.1304239276985;776.7669699090278;810.3031393002013;815.0789607743271;822.416084579943;825.4634487583058;825.471698113208;825.5830805443272;827.2843989948681;609.1137395090177;610.2585358789048;610.6153123532147;610.9755609775603;611.1382950040467;12008.459619317151;12285.57000504978;12303.75392492154;12330.5067797288;12332.630021099381;11556.59551915679;12023.218490798157;12344.938275308656;12355.814662780065;12638.304893230868;9073.274138068939;9091.590878410487;9135.497547634877;9172.174504294646;9190.126937940884;3179.0939582218957;3276.2300859298048;3277.049655599873;3284.5237440571223;3335.7664963452567;42647.786761065996;42987.35518967218;42989.35515967263;42994;42998.785006074766;9337.112974267433;9460.621575136918;9529.094736000068;9568.521573921276;9665.90334096664;17296.135193240538;17452.040137792545;17525.47423577295;17538.561535961704;17544.29822807099;6333.809985700436;6388.680565971683;6461.353864613501;6484.967575162094;6567.737290508422;3333.1667083229195;3384.627690953993;3415.7267418606452;3554.608993010767;3568.3398571264397;2687.261003224129;2745.3960128771637;2745.8215216010894;2746.231055304518;2749.1065403743864;467.7707923117716;487.6927535652516;492.13875717494386;495.26453216972766;504.19329073482135;500.87227756921754;524.2634099090784;529.4467281690643;567.5686478276457;574.5805561939808;7048.682809273595;7063.82340441493;7133.429325654039;7228.38558722504;8230.8353832923;480.16930709872116;499.30845778596904;569.3566270114744;571.7970120607208;573.526840356699;3396.3207358528393;3551.964480355215;3587.6232995535092;3607.6572725591027;3688.280785246851;50840.49159508431;51209.743951280005;51354.74322628438;51362;51515.48484515182;40419.7979010109;40420.79789601033;40453.595464044985;40582.39126413106;40647.18705625871;41883.7905810469;41935.790321048196;42093.15813683709;42565.148697025885;42980.78509607369;7768.223177682186;8094.676212951416;8143.267105960492;8204.83590328178;8349.749507514784;31387.21531961628;31909.20226994344;31913.042608721775;32160;32395.51406728854;36635.26729465449;36833;37123.25753484969;41335.1732965345;41491.58508414877;9344.859827102462;10020.749481263027;10121.645742399276;10139.847902281324;10195.111810649458;11158.274712143684;11603;11658.18392712502;11733.413329333669;11940.52237910474;10244.385336879513;10321.638742644272;10390.324628899098;10835.945820270848;10852.782944341227;10766.515506802369;10805.945970270099;10813.783724325313;10867.619633312795;11097.223194376316;8002.359811214972;9147.908520914973;9710.271729620448;9907.702768916944;9953.203743700342;8853.247473964528;9250.768730781785;9369.109934556207;9403.106704863027;9691.70924872255;9031.187193152648;9358.485283309483;9488.762780930532;9502.904970950201;9511.809763804547 15:31:21 INFO - 2015-11-19 15:31:21,143 DEBUG : BROWSER_OUTPUT: __end_tp_report 15:31:21 INFO - 2015-11-19 15:31:21,143 DEBUG : BROWSER_OUTPUT: __start_cc_report 15:31:21 INFO - 2015-11-19 15:31:21,143 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1218 15:31:21 INFO - 2015-11-19 15:31:21,144 DEBUG : BROWSER_OUTPUT: __end_cc_report 15:31:21 INFO - 2015-11-19 15:31:21,144 DEBUG : BROWSER_OUTPUT: __startTimestamp1447975881128__endTimestamp 15:31:21 INFO - 2015-11-19 15:31:21,144 DEBUG : BROWSER_OUTPUT: 15:31:21 INFO - 2015-11-19 15:31:21,144 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 15:31:21 INFO - 2015-11-19 15:31:21,144 DEBUG : BROWSER_OUTPUT: Number of tests: 6 15:31:21 INFO - 2015-11-19 15:31:21,144 DEBUG : BROWSER_OUTPUT: 15:31:21 INFO - 2015-11-19 15:31:21,144 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4729.17 Median:4877.76 stddev:504.65 (10.3%) stddev-sans-first:479.92 15:31:21 INFO - 2015-11-19 15:31:21,144 DEBUG : BROWSER_OUTPUT: Values: 2680.2 2794.8 2796.9 2808.8 2819.1 4680.2 4801.5 4830.9 4854.1 4905.9 4640.2 4770.4 4773.6 4785.8 4789.6 4281.5 4352.5 4359.3 4403.3 4438.4 4445.5 4469.4 4488.1 4499.0 4510.1 4327.7 4441.9 4495.3 4499.7 4571.9 4357.5 4359.5 4362.2 4366.8 4368.8 4338.0 4342.0 4350.2 4354.2 4357.8 4618.7 4635.7 4654.5 4659.8 4676.4 5113.2 5193.7 5216.3 5218.1 5222.6 5211.4 5217.3 5241.1 5245.3 5298.6 4646.1 4704.2 4729.6 4778.8 4820.6 5279.8 5314.5 5321.5 5321.7 5325.1 5044.9 5081.8 5095.8 5097.8 5139.7 4956.3 5007.2 5149.4 5152.9 5173.9 5052.0 5126.6 5146.7 5147.1 5155.4 5100.7 5124.8 5136.3 5138.3 5175.8 4037.7 4125.9 4132.6 4278.4 4328.2 3656.5 3704.5 3741.3 3749.4 3751.2 4405.4 4434.7 4435.0 4438.9 4473.2 4925.1 5199.2 5201.7 5202.2 5203.9 4257.0 4284.0 4294.5 4296.8 4338.2 4574.1 4579.1 4581.2 4582.5 4633.6 4580.8 4894.4 4894.7 4915.1 4977.2 5026.1 5054.4 5083.7 5230.5 5235.6 4868.6 4875.5 4875.6 4907.9 4920.4 5057.8 5057.9 5058.1 5063.5 5096.4 4908.1 5016.4 5026.6 5132.8 5138.2 4870.2 4894.0 4959.8 5002.3 5010.4 5013.0 5034.9 5035.2 5037.0 5084.2 4588.0 4945.8 4950.7 4952.8 4962.2 4995.4 5016.9 5018.2 5019.5 5025.2 4811.9 4876.2 4877.8 4905.1 4943.6 15:31:21 INFO - 2015-11-19 15:31:21,145 DEBUG : BROWSER_OUTPUT: 15:31:21 INFO - 2015-11-19 15:31:21,145 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:42234.75 Median:17249.65 stddev:69482.02 (402.8%) stddev-sans-first:69606.52 15:31:21 INFO - 2015-11-19 15:31:21,145 DEBUG : BROWSER_OUTPUT: Values: 574.8 575.1 580.6 581.2 593.1 28071.6 28553.7 28616.3 28620.9 28653.7 29169.6 36699.4 37274.3 37453.0 37580.2 7771.8 7896.1 7901.6 7913.8 7917.2 7120.9 7308.5 7785.3 7888.7 7889.0 10155.5 10396.4 10399.2 10400.4 10404.9 9955.1 9999.3 10050.4 10086.3 10089.0 9875.1 10027.0 10046.3 10050.1 10056.9 38530.2 38982.8 39032.6 39059.8 39170.8 3032.4 3075.3 3142.3 3586.2 3638.6 27250.9 27744.3 27780.0 28034.0 28109.9 3490.3 3505.3 3520.7 3543.6 3600.9 218740.0 220540.9 221292.0 221466.0 222376.0 49042.5 50033.7 57049.0 57586.4 60433.1 55871.4 55949.7 56167.9 56226.7 56275.2 14499.0 14586.9 14659.0 14673.9 14691.9 11417.5 11505.6 11507.0 11509.4 11517.3 18900.7 19109.2 19154.0 19158.4 19181.3 7576.1 7807.5 7839.6 7896.2 7918.8 884.8 902.5 915.5 984.3 1050.7 27215.3 30190.2 31266.4 31275.7 31656.2 899.6 958.7 1020.7 1051.3 1067.1 13632.0 13830.5 13886.9 13901.9 13973.7 316218.0 321815.0 322423.0 322488.0 324110.0 45411.5 45890.8 45913.8 45941.0 45975.3 1194.2 1197.0 1205.7 1206.8 1210.6 23051.7 30166.4 30560.5 30657.5 30677.7 43501.3 43980.6 44073.0 44107.8 44122.6 243414.0 244924.0 245514.0 246007.0 246976.0 24166.9 24777.4 29907.9 30262.7 30692.7 35659.0 36542.5 36715.8 36938.0 37244.6 29783.4 29914.9 31357.0 31777.0 31852.5 32474.4 32576.5 32861.8 37552.8 39358.2 33524.8 34163.3 34276.5 34349.7 34405.8 28783.7 29895.3 30456.1 30559.2 30568.7 23597.3 23665.2 24008.0 24045.9 24067.6 15:31:21 INFO - 2015-11-19 15:31:21,145 DEBUG : BROWSER_OUTPUT: 15:31:21 INFO - 2015-11-19 15:31:21,145 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:26431.73 Median:3661.77 stddev:79714.37 (2176.9%) stddev-sans-first:79913.88 15:31:21 INFO - 2015-11-19 15:31:21,146 DEBUG : BROWSER_OUTPUT: Values: 322.2 322.5 325.3 343.9 345.7 12310.4 12773.8 14837.0 15436.6 15712.5 14956.4 15348.1 16012.8 16233.9 16263.5 4894.3 4951.8 5119.8 5123.4 5125.9 3616.9 3730.5 3733.4 3734.3 5073.9 3706.6 5513.4 5688.3 5694.5 5699.7 5507.5 5641.7 5654.0 5670.6 5673.1 5095.4 5112.6 5114.1 5116.3 5117.1 18987.4 19297.1 19507.6 19558.4 19633.3 1856.9 1933.6 1939.4 2045.8 2078.5 12438.3 12669.2 12768.2 12835.0 13068.9 1698.3 1723.6 1730.8 1761.2 1804.1 50682.0 51722.0 53960.0 54659.7 55475.4 8476.6 8965.9 9775.6 9848.0 9856.2 12466.1 12466.3 12475.2 12483.1 12488.9 6870.5 6877.6 6885.4 6911.3 6960.1 6465.0 6506.5 6516.6 6552.0 6562.9 3753.8 3788.3 3789.0 4113.8 4213.1 1555.1 1604.1 1610.5 1691.8 1736.6 838.9 863.5 913.4 925.6 939.3 15137.2 15743.1 16133.1 16398.9 16472.6 775.5 828.1 874.2 885.7 934.3 8953.4 9079.9 9130.2 9225.1 9337.5 471140.0 476913.0 495598.0 497160.0 500152.0 70769.6 71125.6 72546.6 72795.6 73189.6 1101.8 1102.4 1107.7 1118.2 1119.5 14818.3 14976.1 15072.3 15072.5 15330.2 32143.4 32147.8 32524.7 32643.7 32952.7 42149.8 42845.8 42921.0 43275.0 46672.5 8989.9 9115.0 9242.0 9245.4 9354.9 16227.1 16492.4 16544.7 16617.5 16844.1 13251.0 13392.8 13832.9 14089.5 14234.9 12394.4 12475.4 13638.9 13784.7 13876.4 10124.8 12660.9 12937.4 13138.6 13635.1 8757.5 8878.3 8982.9 8990.4 9008.7 12106.3 12290.9 12414.3 13092.1 13419.5 15:31:21 INFO - 2015-11-19 15:31:21,146 DEBUG : BROWSER_OUTPUT: 15:31:21 INFO - 2015-11-19 15:31:21,146 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5012.02 Median:6313.25 stddev:2598.56 (41.2%) stddev-sans-first:2592.16 15:31:21 INFO - 2015-11-19 15:31:21,146 DEBUG : BROWSER_OUTPUT: Values: 1463.0 1654.4 1668.3 1723.7 1730.9 6153.0 6805.9 6924.4 6934.3 6940.5 7118.3 7224.8 7232.8 7241.7 7262.2 1748.5 1777.4 2029.4 2058.0 2082.3 2111.3 2117.9 2120.4 2122.1 2129.6 2037.0 2082.1 2107.1 2113.9 2114.5 1756.0 1811.1 2019.1 2070.0 2074.0 2110.7 2115.2 2133.7 2135.5 2135.7 7244.9 7277.9 7299.1 7299.9 7306.7 4321.7 4401.7 4410.0 4432.4 4433.3 2833.7 2845.1 2884.7 2890.1 2994.2 877.0 896.3 921.5 925.4 1695.2 9556.0 9572.1 9615.0 9622.1 9633.9 3948.2 4011.5 4046.7 4054.8 4098.1 8080.1 8085.6 8112.5 8116.5 8136.9 4372.2 4387.8 4441.2 4442.0 4445.8 4068.6 4080.6 4083.0 4086.7 4087.8 3164.8 3195.2 3215.9 3242.3 3246.6 961.8 981.9 985.2 985.7 994.3 1132.8 1143.8 1152.4 1158.5 1161.5 6725.3 6752.9 6753.5 6764.6 6799.4 443.9 454.8 455.0 457.6 463.4 5370.9 5424.1 5426.1 5427.4 5432.5 8528.7 8655.7 8656.8 8685.0 8904.6 7984.4 8047.7 8117.2 8120.4 8135.0 6797.1 6817.5 6888.4 6936.5 6943.1 6871.9 6939.4 6960.4 6965.4 6968.0 7747.8 7878.7 7908.8 8025.3 8026.6 8014.5 8030.5 8098.8 8238.1 8247.1 6220.8 6242.0 6319.8 6332.2 6495.3 6845.2 6873.6 7012.5 7027.1 7069.8 6427.1 6469.3 6595.8 6669.9 6760.0 5623.3 6306.7 6360.7 6445.5 6486.4 6346.3 6386.7 6391.3 6392.1 6405.1 5385.3 5433.5 5435.0 5442.3 5443.7 6160.1 6188.8 6195.9 6196.6 6196.9 15:31:21 INFO - 2015-11-19 15:31:21,146 DEBUG : BROWSER_OUTPUT: 15:31:21 INFO - 2015-11-19 15:31:21,146 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4728.37 Median:5415.15 stddev:1388.74 (25.6%) stddev-sans-first:1352.51 15:31:21 INFO - 2015-11-19 15:31:21,146 DEBUG : BROWSER_OUTPUT: Values: 312.5 313.2 323.0 327.0 327.5 5362.0 5425.7 5471.2 5504.8 5505.4 5387.5 5410.7 5415.0 5415.3 5415.4 4003.8 4108.7 4126.5 4208.9 4212.7 4210.8 4217.6 4242.8 4250.5 4252.5 4185.8 4197.3 4204.0 4211.8 4214.4 3986.0 4086.1 4104.0 4158.1 4213.3 3720.8 3729.0 3729.5 3738.3 3740.5 5168.6 5182.4 5184.4 5187.5 5189.3 4868.4 4869.8 4872.3 4874.6 4878.0 5553.4 5644.2 5682.1 5690.3 5698.7 4039.9 4044.6 4044.9 4045.4 4051.5 5969.9 5973.3 5977.5 5983.0 5984.6 4152.6 4162.0 4163.2 4164.9 4165.5 4004.3 4125.0 4128.6 4131.7 4211.1 4715.9 4757.2 4786.6 4787.9 4790.6 5681.1 5684.4 5698.3 5708.2 5709.6 1443.9 1472.2 1473.7 1474.0 1474.0 962.2 970.7 991.9 992.0 1000.7 4945.1 4945.7 4951.2 4952.1 4953.3 5881.1 5888.6 5895.6 5896.3 5898.2 4933.5 4938.8 4943.4 4945.2 4952.3 3006.3 3059.3 3069.0 3121.8 3156.2 5535.2 5616.2 5616.6 5632.8 5640.4 6107.4 6109.4 6115.1 6116.5 6117.1 5615.9 5622.0 5625.0 5625.4 5625.5 5752.8 5923.3 5931.5 5931.9 5934.6 5820.9 5822.5 5824.9 5825.4 5828.2 5604.2 5613.6 5615.7 5620.1 5623.7 3992.4 4104.1 4107.2 4111.9 4128.2 5916.3 5924.6 5931.9 5936.8 5938.4 5676.7 5693.1 5693.9 5694.5 5695.5 5536.5 5681.9 5685.1 5686.3 5689.6 5541.4 5560.8 5563.2 5580.4 5586.0 5735.0 5751.6 5751.7 5757.1 5760.7 5384.7 5483.7 5491.0 5492.9 5501.8 15:31:21 INFO - 2015-11-19 15:31:21,146 DEBUG : BROWSER_OUTPUT: 15:31:21 INFO - 2015-11-19 15:31:21,148 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12318.72 Median:483.93 stddev:13927.26 (2877.9%) stddev-sans-first:13938.90 15:31:21 INFO - 2015-11-19 15:31:21,148 DEBUG : BROWSER_OUTPUT: Values: 678.9 692.9 766.5 780.3 801.2 11344.5 11524.0 11567.8 11736.9 11791.9 10575.4 11580.9 12190.1 12194.1 12203.1 599.6 775.3 788.3 789.2 789.5 779.7 794.3 795.3 795.3 795.6 639.0 644.1 776.8 810.3 815.1 822.4 825.5 825.5 825.6 827.3 609.1 610.3 610.6 611.0 611.1 12008.5 12285.6 12303.8 12330.5 12332.6 11556.6 12023.2 12344.9 12355.8 12638.3 9073.3 9091.6 9135.5 9172.2 9190.1 3179.1 3276.2 3277.0 3284.5 3335.8 42647.8 42987.4 42989.4 42994.0 42998.8 9337.1 9460.6 9529.1 9568.5 9665.9 17296.1 17452.0 17525.5 17538.6 17544.3 6333.8 6388.7 6461.4 6485.0 6567.7 3333.2 3384.6 3415.7 3554.6 3568.3 2687.3 2745.4 2745.8 2746.2 2749.1 467.8 487.7 492.1 495.3 504.2 500.9 524.3 529.4 567.6 574.6 7048.7 7063.8 7133.4 7228.4 8230.8 480.2 499.3 569.4 571.8 573.5 3396.3 3552.0 3587.6 3607.7 3688.3 50840.5 51209.7 51354.7 51362.0 51515.5 40419.8 40420.8 40453.6 40582.4 40647.2 41883.8 41935.8 42093.2 42565.1 42980.8 7768.2 8094.7 8143.3 8204.8 8349.7 31387.2 31909.2 31913.0 32160.0 32395.5 36635.3 36833.0 37123.3 41335.2 41491.6 9344.9 10020.7 10121.6 10139.8 10195.1 11158.3 11603.0 11658.2 11733.4 11940.5 10244.4 10321.6 10390.3 10835.9 10852.8 10766.5 10805.9 10813.8 10867.6 11097.2 8002.4 9147.9 9710.3 9907.7 9953.2 8853.2 9250.8 9369.1 9403.1 9691.7 9031.2 9358.5 9488.8 9502.9 9511.8 15:31:21 INFO - 2015-11-19 15:31:21,148 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 15:31:21 INFO - 2015-11-19 15:31:21,148 DEBUG : BROWSER_OUTPUT: 15:31:21 INFO - 2015-11-19 15:31:21,865 INFO : Browser exited with error code: 0 15:31:21 INFO - 2015-11-19 15:31:21,881 INFO : Completed test dromaeo_css (00:18:38) 15:31:21 INFO - 2015-11-19 15:31:21,881 INFO : Starting test kraken 15:31:21 INFO - 2015-11-19 15:31:21,881 DEBUG : operating with platform_type : linux_ 15:31:21 INFO - 2015-11-19 15:31:21,881 INFO : Initialising browser for kraken test... 15:31:21 INFO - 2015-11-19 15:31:21,887 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpR3Tnlp/profile http://localhost:52126/getInfo.html 15:31:25 INFO - 2015-11-19 15:31:25,857 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 15:31:25 INFO - 2015-11-19 15:31:25,857 DEBUG : BROWSER_OUTPUT: colorDepth:24 15:31:25 INFO - 2015-11-19 15:31:25,857 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 15:31:25 INFO - 2015-11-19 15:31:25,857 DEBUG : BROWSER_OUTPUT: __metrics 15:31:25 INFO - 2015-11-19 15:31:25,961 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:31:26 INFO - 2015-11-19 15:31:26,594 DEBUG : BROWSER_OUTPUT: console.error: 15:31:26 INFO - 2015-11-19 15:31:26,598 DEBUG : BROWSER_OUTPUT: Message: Error: Connection closed before committing the transaction. 15:31:26 INFO - 2015-11-19 15:31:26,598 DEBUG : BROWSER_OUTPUT: Stack: 15:31:26 INFO - 2015-11-19 15:31:26,598 DEBUG : BROWSER_OUTPUT: ConnectionData.prototype<.executeTransaction/promise resource://gre/modules/Promise-backend.js:934:23 15:31:26 INFO - 2015-11-19 15:31:26,598 DEBUG : BROWSER_OUTPUT: this.PromiseWalker.walkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:813:7 15:31:26 INFO - 2015-11-19 15:31:26,598 DEBUG : BROWSER_OUTPUT: Promise*this.PromiseWalker.scheduleWalkerLoop@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:744:11 15:31:26 INFO - 2015-11-19 15:31:26,599 DEBUG : BROWSER_OUTPUT: this.PromiseWalker.schedulePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:776:7 15:31:26 INFO - 2015-11-19 15:31:26,599 DEBUG : BROWSER_OUTPUT: this.PromiseWalker.completePromise@resource://gre/modules/Promise.jsm -> resource://gre/modules/Promise-backend.js:711:7 15:31:26 INFO - 2015-11-19 15:31:26,599 DEBUG : BROWSER_OUTPUT: TaskImpl_run@resource://gre/modules/Task.jsm:319:13 15:31:26 INFO - 2015-11-19 15:31:26,599 DEBUG : BROWSER_OUTPUT: Spinner.prototype.observe@resource://gre/modules/AsyncShutdown.jsm:523:9 15:31:26 INFO - 2015-11-19 15:31:26,599 DEBUG : BROWSER_OUTPUT: nsAsyncShutdownBarrier.prototype.wait/<@resource://gre/components/nsAsyncShutdown.js:215:7 15:31:26 INFO - 2015-11-19 15:31:26,599 DEBUG : BROWSER_OUTPUT: Spinner.prototype.observe@resource://gre/modules/AsyncShutdown.jsm:523:9 15:31:26 INFO - 2015-11-19 15:31:26,599 DEBUG : BROWSER_OUTPUT: 15:31:27 INFO - 2015-11-19 15:31:27,206 INFO : Browser initialized. 15:31:27 INFO - 2015-11-19 15:31:27,207 INFO : Running cycle 1/1 for kraken test... 15:31:27 INFO - 2015-11-19 15:31:27,207 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpR3Tnlp/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 15:31:39 INFO - 2015-11-19 15:31:39,165 DEBUG : BROWSER_OUTPUT: RSS: Main: 142237696 15:31:39 INFO - 2015-11-19 15:31:39,165 DEBUG : BROWSER_OUTPUT: 15:31:41 INFO - 2015-11-19 15:31:41,776 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:52126/tests/kraken/driver.html?testName=audio-beat-detection) 15:31:42 INFO - 2015-11-19 15:31:42,362 DEBUG : BROWSER_OUTPUT: RSS: Main: 175898624 15:31:42 INFO - 2015-11-19 15:31:42,362 DEBUG : BROWSER_OUTPUT: 15:31:45 INFO - 2015-11-19 15:31:45,071 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:52126/tests/kraken/driver.html?testName=audio-dft) 15:31:45 INFO - 2015-11-19 15:31:45,644 DEBUG : BROWSER_OUTPUT: RSS: Main: 166141952 15:31:45 INFO - 2015-11-19 15:31:45,645 DEBUG : BROWSER_OUTPUT: 15:31:48 INFO - 2015-11-19 15:31:48,689 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:52126/tests/kraken/driver.html?testName=audio-fft) 15:31:49 INFO - 2015-11-19 15:31:49,255 DEBUG : BROWSER_OUTPUT: RSS: Main: 151986176 15:31:49 INFO - 2015-11-19 15:31:49,255 DEBUG : BROWSER_OUTPUT: 15:31:51 INFO - 2015-11-19 15:31:51,287 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:52126/tests/kraken/driver.html?testName=audio-oscillator) 15:31:51 INFO - 2015-11-19 15:31:51,860 DEBUG : BROWSER_OUTPUT: RSS: Main: 154828800 15:31:51 INFO - 2015-11-19 15:31:51,860 DEBUG : BROWSER_OUTPUT: 15:31:54 INFO - 2015-11-19 15:31:54,053 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:52126/tests/kraken/driver.html?testName=imaging-gaussian-blur) 15:31:54 INFO - 2015-11-19 15:31:54,619 DEBUG : BROWSER_OUTPUT: RSS: Main: 157106176 15:31:54 INFO - 2015-11-19 15:31:54,619 DEBUG : BROWSER_OUTPUT: 15:31:57 INFO - 2015-11-19 15:31:57,637 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:52126/tests/kraken/driver.html?testName=imaging-darkroom) 15:31:58 INFO - 2015-11-19 15:31:58,219 DEBUG : BROWSER_OUTPUT: RSS: Main: 156618752 15:31:58 INFO - 2015-11-19 15:31:58,220 DEBUG : BROWSER_OUTPUT: 15:32:01 INFO - 2015-11-19 15:32:01,604 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:52126/tests/kraken/driver.html?testName=imaging-desaturate) 15:32:02 INFO - 2015-11-19 15:32:02,177 DEBUG : BROWSER_OUTPUT: RSS: Main: 157921280 15:32:02 INFO - 2015-11-19 15:32:02,177 DEBUG : BROWSER_OUTPUT: 15:32:05 INFO - 2015-11-19 15:32:05,015 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:52126/tests/kraken/driver.html?testName=json-parse-financial) 15:32:05 INFO - 2015-11-19 15:32:05,596 DEBUG : BROWSER_OUTPUT: RSS: Main: 157089792 15:32:05 INFO - 2015-11-19 15:32:05,596 DEBUG : BROWSER_OUTPUT: 15:32:07 INFO - 2015-11-19 15:32:07,330 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:52126/tests/kraken/driver.html?testName=json-stringify-tinderbox) 15:32:07 INFO - 2015-11-19 15:32:07,896 DEBUG : BROWSER_OUTPUT: RSS: Main: 163983360 15:32:07 INFO - 2015-11-19 15:32:07,896 DEBUG : BROWSER_OUTPUT: 15:32:09 INFO - 2015-11-19 15:32:09,790 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:52126/tests/kraken/driver.html?testName=stanford-crypto-aes) 15:32:10 INFO - 2015-11-19 15:32:10,393 DEBUG : BROWSER_OUTPUT: RSS: Main: 164487168 15:32:10 INFO - 2015-11-19 15:32:10,393 DEBUG : BROWSER_OUTPUT: 15:32:12 INFO - 2015-11-19 15:32:12,525 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:52126/tests/kraken/driver.html?testName=stanford-crypto-ccm) 15:32:13 INFO - 2015-11-19 15:32:13,107 DEBUG : BROWSER_OUTPUT: RSS: Main: 173850624 15:32:13 INFO - 2015-11-19 15:32:13,107 DEBUG : BROWSER_OUTPUT: 15:32:15 INFO - 2015-11-19 15:32:15,655 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:52126/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 15:32:16 INFO - 2015-11-19 15:32:16,240 DEBUG : BROWSER_OUTPUT: RSS: Main: 179326976 15:32:16 INFO - 2015-11-19 15:32:16,241 DEBUG : BROWSER_OUTPUT: 15:32:18 INFO - 2015-11-19 15:32:18,822 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:52126/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 15:32:19 INFO - 2015-11-19 15:32:19,404 DEBUG : BROWSER_OUTPUT: RSS: Main: 177844224 15:32:19 INFO - 2015-11-19 15:32:19,404 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,158 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:52126/tests/kraken/driver.html?testName=ai-astar) 15:32:21 INFO - 2015-11-19 15:32:21,408 DEBUG : BROWSER_OUTPUT: RSS: Main: 235712512 15:32:21 INFO - 2015-11-19 15:32:21,409 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,409 DEBUG : BROWSER_OUTPUT: __start_tp_report 15:32:21 INFO - 2015-11-19 15:32:21,409 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 15:32:21 INFO - 2015-11-19 15:32:21,409 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 15:32:21 INFO - 2015-11-19 15:32:21,410 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 15:32:21 INFO - 2015-11-19 15:32:21,410 DEBUG : BROWSER_OUTPUT: |0;ai-astar;110;115;107;112;112;111;101;113;103;111 15:32:21 INFO - 2015-11-19 15:32:21,410 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;156;130;151;167;131;152;158;129;173;132 15:32:21 INFO - 2015-11-19 15:32:21,410 DEBUG : BROWSER_OUTPUT: |2;audio-dft;162;163;161;163;162;162;164;164;161;161 15:32:21 INFO - 2015-11-19 15:32:21,411 DEBUG : BROWSER_OUTPUT: |3;audio-fft;74;73;82;101;72;73;73;105;89;72 15:32:21 INFO - 2015-11-19 15:32:21,411 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;91;92;124;91;92;91;127;91;91;123 15:32:21 INFO - 2015-11-19 15:32:21,411 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;109;109;110;109;110;109;110;109;109 15:32:21 INFO - 2015-11-19 15:32:21,411 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;146;147;146;147;147;147;146;147;146;147 15:32:21 INFO - 2015-11-19 15:32:21,411 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;95;95;95;95;96;95;95;95 15:32:21 INFO - 2015-11-19 15:32:21,412 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;68;68;69;69;72;68;70;78;66;66 15:32:21 INFO - 2015-11-19 15:32:21,412 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;68;68;69;69;69;70;69;69;68 15:32:21 INFO - 2015-11-19 15:32:21,412 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;81;84;85;83;84;83;84;84;83;83 15:32:21 INFO - 2015-11-19 15:32:21,412 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;124;128;128;129;132;120;125;121;129;121 15:32:21 INFO - 2015-11-19 15:32:21,413 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;146;144;145;144;151;135;143;142;142;136 15:32:21 INFO - 2015-11-19 15:32:21,413 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;70;69;71;69;71;70;68;71;70;71 15:32:21 INFO - 2015-11-19 15:32:21,413 DEBUG : BROWSER_OUTPUT: __end_tp_report 15:32:21 INFO - 2015-11-19 15:32:21,413 DEBUG : BROWSER_OUTPUT: __start_cc_report 15:32:21 INFO - 2015-11-19 15:32:21,414 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,982 15:32:21 INFO - 2015-11-19 15:32:21,414 DEBUG : BROWSER_OUTPUT: __end_cc_report 15:32:21 INFO - 2015-11-19 15:32:21,414 DEBUG : BROWSER_OUTPUT: __startTimestamp1447975941407__endTimestamp 15:32:21 INFO - 2015-11-19 15:32:21,414 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,418 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 15:32:21 INFO - 2015-11-19 15:32:21,418 DEBUG : BROWSER_OUTPUT: Number of tests: 14 15:32:21 INFO - 2015-11-19 15:32:21,418 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,418 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:109.50 Median:111.50 stddev:4.48 (4.0%) stddev-sans-first:4.75 15:32:21 INFO - 2015-11-19 15:32:21,418 DEBUG : BROWSER_OUTPUT: Values: 110.0 115.0 107.0 112.0 112.0 111.0 101.0 113.0 103.0 111.0 15:32:21 INFO - 2015-11-19 15:32:21,418 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,418 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:147.90 Median:154.00 stddev:16.35 (10.6%) stddev-sans-first:17.07 15:32:21 INFO - 2015-11-19 15:32:21,419 DEBUG : BROWSER_OUTPUT: Values: 156.0 130.0 151.0 167.0 131.0 152.0 158.0 129.0 173.0 132.0 15:32:21 INFO - 2015-11-19 15:32:21,419 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,419 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:162.30 Median:162.50 stddev:1.16 (0.7%) stddev-sans-first:1.22 15:32:21 INFO - 2015-11-19 15:32:21,419 DEBUG : BROWSER_OUTPUT: Values: 162.0 163.0 161.0 163.0 162.0 162.0 164.0 164.0 161.0 161.0 15:32:21 INFO - 2015-11-19 15:32:21,419 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,419 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:81.40 Median:73.00 stddev:12.66 (17.3%) stddev-sans-first:13.14 15:32:21 INFO - 2015-11-19 15:32:21,419 DEBUG : BROWSER_OUTPUT: Values: 74.0 73.0 82.0 101.0 72.0 73.0 73.0 105.0 89.0 72.0 15:32:21 INFO - 2015-11-19 15:32:21,419 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,420 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:101.30 Median:91.00 stddev:16.16 (17.8%) stddev-sans-first:16.70 15:32:21 INFO - 2015-11-19 15:32:21,420 DEBUG : BROWSER_OUTPUT: Values: 91.0 92.0 124.0 91.0 92.0 91.0 127.0 91.0 91.0 123.0 15:32:21 INFO - 2015-11-19 15:32:21,420 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,420 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.30 Median:109.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 15:32:21 INFO - 2015-11-19 15:32:21,420 DEBUG : BROWSER_OUTPUT: Values: 109.0 109.0 109.0 110.0 109.0 110.0 109.0 110.0 109.0 109.0 15:32:21 INFO - 2015-11-19 15:32:21,420 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,420 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:146.60 Median:147.00 stddev:0.52 (0.4%) stddev-sans-first:0.50 15:32:21 INFO - 2015-11-19 15:32:21,420 DEBUG : BROWSER_OUTPUT: Values: 146.0 147.0 146.0 147.0 147.0 147.0 146.0 147.0 146.0 147.0 15:32:21 INFO - 2015-11-19 15:32:21,421 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,421 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 15:32:21 INFO - 2015-11-19 15:32:21,421 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 95.0 95.0 95.0 95.0 96.0 95.0 95.0 95.0 15:32:21 INFO - 2015-11-19 15:32:21,421 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,421 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:69.40 Median:69.00 stddev:3.50 (5.1%) stddev-sans-first:3.68 15:32:21 INFO - 2015-11-19 15:32:21,421 DEBUG : BROWSER_OUTPUT: Values: 68.0 68.0 69.0 69.0 72.0 68.0 70.0 78.0 66.0 66.0 15:32:21 INFO - 2015-11-19 15:32:21,421 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,421 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.70 Median:69.00 stddev:0.67 (1.0%) stddev-sans-first:0.67 15:32:21 INFO - 2015-11-19 15:32:21,421 DEBUG : BROWSER_OUTPUT: Values: 68.0 68.0 68.0 69.0 69.0 69.0 70.0 69.0 69.0 68.0 15:32:21 INFO - 2015-11-19 15:32:21,422 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,422 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:83.40 Median:84.00 stddev:1.07 (1.3%) stddev-sans-first:0.71 15:32:21 INFO - 2015-11-19 15:32:21,422 DEBUG : BROWSER_OUTPUT: Values: 81.0 84.0 85.0 83.0 84.0 83.0 84.0 84.0 83.0 83.0 15:32:21 INFO - 2015-11-19 15:32:21,422 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,422 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:125.70 Median:128.00 stddev:4.11 (3.2%) stddev-sans-first:4.31 15:32:21 INFO - 2015-11-19 15:32:21,422 DEBUG : BROWSER_OUTPUT: Values: 124.0 128.0 128.0 129.0 132.0 120.0 125.0 121.0 129.0 121.0 15:32:21 INFO - 2015-11-19 15:32:21,422 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,422 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:142.80 Median:144.00 stddev:4.64 (3.2%) stddev-sans-first:4.77 15:32:21 INFO - 2015-11-19 15:32:21,422 DEBUG : BROWSER_OUTPUT: Values: 146.0 144.0 145.0 144.0 151.0 135.0 143.0 142.0 142.0 136.0 15:32:21 INFO - 2015-11-19 15:32:21,423 DEBUG : BROWSER_OUTPUT: 15:32:21 INFO - 2015-11-19 15:32:21,423 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.00 Median:70.50 stddev:1.05 (1.5%) stddev-sans-first:1.12 15:32:21 INFO - 2015-11-19 15:32:21,423 DEBUG : BROWSER_OUTPUT: Values: 70.0 69.0 71.0 69.0 71.0 70.0 68.0 71.0 70.0 71.0 15:32:21 INFO - 2015-11-19 15:32:21,423 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 15:32:21 INFO - 2015-11-19 15:32:21,423 DEBUG : BROWSER_OUTPUT: 15:32:22 INFO - 2015-11-19 15:32:22,293 INFO : Browser exited with error code: 0 15:32:22 INFO - 2015-11-19 15:32:22,344 INFO : Completed test kraken (00:01:00) 15:32:22 INFO - 2015-11-19 15:32:22,344 INFO : Starting test v8_7 15:32:22 INFO - 2015-11-19 15:32:22,344 DEBUG : operating with platform_type : linux_ 15:32:22 INFO - 2015-11-19 15:32:22,344 INFO : Initialising browser for v8_7 test... 15:32:22 INFO - 2015-11-19 15:32:22,350 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpn0LH1I/profile http://localhost:52126/getInfo.html 15:32:26 INFO - 2015-11-19 15:32:26,466 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 15:32:26 INFO - 2015-11-19 15:32:26,466 DEBUG : BROWSER_OUTPUT: colorDepth:24 15:32:26 INFO - 2015-11-19 15:32:26,466 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 15:32:26 INFO - 2015-11-19 15:32:26,466 DEBUG : BROWSER_OUTPUT: __metrics 15:32:26 INFO - 2015-11-19 15:32:26,628 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:32:27 INFO - 2015-11-19 15:32:27,920 INFO : Browser initialized. 15:32:27 INFO - 2015-11-19 15:32:27,921 INFO : Running cycle 1/1 for v8_7 test... 15:32:27 INFO - 2015-11-19 15:32:27,921 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpn0LH1I/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 15:32:39 INFO - 2015-11-19 15:32:39,825 DEBUG : BROWSER_OUTPUT: RSS: Main: 141500416 15:32:39 INFO - 2015-11-19 15:32:39,826 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,238 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:52126/tests/v8_7/run.html (next: http://localhost:52126/tests/v8_7/run.html) 15:33:01 INFO - 2015-11-19 15:33:01,488 DEBUG : BROWSER_OUTPUT: RSS: Main: 442732544 15:33:01 INFO - 2015-11-19 15:33:01,489 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,489 DEBUG : BROWSER_OUTPUT: __start_tp_report 15:33:01 INFO - 2015-11-19 15:33:01,489 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 15:33:01 INFO - 2015-11-19 15:33:01,489 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 15:33:01 INFO - 2015-11-19 15:33:01,490 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 15:33:01 INFO - 2015-11-19 15:33:01,490 DEBUG : BROWSER_OUTPUT: |0;Richards;162.86644951140065 15:33:01 INFO - 2015-11-19 15:33:01,490 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;191.9754271453254 15:33:01 INFO - 2015-11-19 15:33:01,490 DEBUG : BROWSER_OUTPUT: |2;Encrypt;281.29395218002816 15:33:01 INFO - 2015-11-19 15:33:01,490 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5081.218274111675 15:33:01 INFO - 2015-11-19 15:33:01,490 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1976.2845849802372 15:33:01 INFO - 2015-11-19 15:33:01,490 DEBUG : BROWSER_OUTPUT: |5;Earley;792.3930269413629 15:33:01 INFO - 2015-11-19 15:33:01,491 DEBUG : BROWSER_OUTPUT: |6;Boyer;11952.380952380952 15:33:01 INFO - 2015-11-19 15:33:01,491 DEBUG : BROWSER_OUTPUT: |7;RegExp;27052.63157894737 15:33:01 INFO - 2015-11-19 15:33:01,491 DEBUG : BROWSER_OUTPUT: |8;Splay;621.5040397762585 15:33:01 INFO - 2015-11-19 15:33:01,491 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4826.923076923077 15:33:01 INFO - 2015-11-19 15:33:01,491 DEBUG : BROWSER_OUTPUT: __end_tp_report 15:33:01 INFO - 2015-11-19 15:33:01,491 DEBUG : BROWSER_OUTPUT: __startTimestamp1447975981488__endTimestamp 15:33:01 INFO - 2015-11-19 15:33:01,492 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,492 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 15:33:01 INFO - 2015-11-19 15:33:01,492 DEBUG : BROWSER_OUTPUT: Number of tests: 10 15:33:01 INFO - 2015-11-19 15:33:01,492 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,492 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:162.87 Median:162.87 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,493 DEBUG : BROWSER_OUTPUT: Values: 162.9 15:33:01 INFO - 2015-11-19 15:33:01,493 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,493 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:191.98 Median:191.98 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,493 DEBUG : BROWSER_OUTPUT: Values: 192.0 15:33:01 INFO - 2015-11-19 15:33:01,494 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,494 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:281.29 Median:281.29 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,495 DEBUG : BROWSER_OUTPUT: Values: 281.3 15:33:01 INFO - 2015-11-19 15:33:01,495 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,495 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5081.22 Median:5081.22 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,495 DEBUG : BROWSER_OUTPUT: Values: 5081.2 15:33:01 INFO - 2015-11-19 15:33:01,495 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,496 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1976.28 Median:1976.28 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,496 DEBUG : BROWSER_OUTPUT: Values: 1976.3 15:33:01 INFO - 2015-11-19 15:33:01,496 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,496 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:792.39 Median:792.39 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,496 DEBUG : BROWSER_OUTPUT: Values: 792.4 15:33:01 INFO - 2015-11-19 15:33:01,496 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,496 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11952.38 Median:11952.38 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: Values: 11952.4 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:27052.63 Median:27052.63 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: Values: 27052.6 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:621.50 Median:621.50 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: Values: 621.5 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4826.92 Median:4826.92 stddev:0.00 (0.0%) 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: Values: 4826.9 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 15:33:01 INFO - 2015-11-19 15:33:01,497 DEBUG : BROWSER_OUTPUT: 15:33:02 INFO - 2015-11-19 15:33:02,425 INFO : Browser exited with error code: 0 15:33:02 INFO - 2015-11-19 15:33:02,437 INFO : Completed test v8_7 (00:00:40) 15:33:02 INFO - 2015-11-19 15:33:02,521 INFO : Completed test suite (00:20:18) 15:33:02 INFO - 2015-11-19 15:33:02,521 DEBUG : Working with test: dromaeo_css 15:33:02 INFO - 2015-11-19 15:33:02,521 DEBUG : Generating results file: dromaeo_css 15:33:02 INFO - 2015-11-19 15:33:02,522 DEBUG : Working with test: kraken 15:33:02 INFO - 2015-11-19 15:33:02,522 DEBUG : Generating results file: kraken 15:33:02 INFO - 2015-11-19 15:33:02,523 INFO : javascript benchmark 15:33:02 INFO - 2015-11-19 15:33:02,523 DEBUG : Working with test: v8_7 15:33:02 INFO - 2015-11-19 15:33:02,523 DEBUG : Generating results file: v8_7 15:33:02 INFO - 2015-11-19 15:33:02,523 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 15:33:02 INFO - 2015-11-19 15:33:02,581 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,132,35]] 15:33:02 INFO - 2015-11-19 15:33:02,581 DEBUG : process_Request line: dromaeo_css 6378.37 graph.html#tests=[[72,132,35]] 15:33:02 INFO - 2015-11-19 15:33:02,581 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 15:33:02 INFO - 2015-11-19 15:33:02,619 DEBUG : process_Request line: kraken 1513.40 graph.html#tests=[[232,132,35]] 15:33:02 INFO - 2015-11-19 15:33:02,619 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 15:33:02 INFO - 2015-11-19 15:33:02,737 DEBUG : process_Request line: v8_7 19780.50 graph.html#tests=[[230,132,35]] 15:33:02 INFO - 2015-11-19 15:33:02,738 INFO : javascript benchmark 15:33:02 INFO - 2015-11-19 15:33:02,742 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2680.2495301315635, 2794.776417886569, 2796.9021084262054, 2808.8174268672533, 2819.1119797263855, 4680.157571637104, 4801.4718380978065, 4830.855074347775, 4854.101991131643, 4905.8528244152685, 4640.1879671057595, 4770.427548694153, 4773.594244489213, 4785.832495862645, 4789.640776941726, 4281.46481689788, 4352.521222665504, 4359.346098085297, 4403.3174857897075, 4438.423005009345, 4445.488768791598, 4469.351943968123, 4488.0799436115685, 4499.0, 4510.075434535912, 4327.653787696977, 4441.9111617767785, 4495.303227999665, 4499.6850220484575, 4571.885702857438, 4357.4988876279, 4359.476862776487, 4362.171187474401, 4366.8253269869165, 4368.825246990116, 4338.002259480306, 4341.978290108561, 4350.216960947028, 4354.238008348558, 4357.825686972517, 4618.699784513996, 4635.745034023127, 4654.4647365553055, 4659.79030943605, 4676.438827340707, 5113.181890897476, 5193.662411943249, 5216.26972223889, 5218.1129208034345, 5222.556082732972, 5211.42674305826, 5217.34783152106, 5241.056609810233, 5245.344331958505, 5298.602604804617, 4646.070785842845, 4704.223803072523, 4729.62163026957, 4778.761061946889, 4820.6143508519235, 5279.841604751864, 5314.5216930476445, 5321.494458026481, 5321.680699158062, 5325.094733895247, 5044.873878153076, 5081.7713202905215, 5095.770690318945, 5097.847064588068, 5139.691618502902, 4956.256561515729, 5007.223880298559, 5149.382074151051, 5152.871178220499, 5173.948260517422, 5052.0, 5126.564242039394, 5146.742662866842, 5147.124988751922, 5155.38135423744, 5100.668456550312, 5124.8206312778875, 5136.306598609214, 5138.254953031789, 5175.767090480862, 4037.717359784787, 4125.855595054219, 4132.648724858421, 4278.443802305743, 4328.220920234388, 3656.469811877263, 3704.481372607837, 3741.2704522618374, 3749.4375843623675, 3751.1934933989323, 4405.427294451701, 4434.7117437367115, 4434.955650443454, 4438.933415998763, 4473.172463094338, 4925.13810083234, 5199.2201169824075, 5201.739913004335, 5202.2456743771945, 5203.895922081537, 4256.978715106405, 4284.0, 4294.527601963781, 4296.849610263688, 4338.197433474817, 4574.130915126116, 4579.129965306581, 4581.152486789954, 4582.541745825458, 4633.606143477775, 4580.839670611513, 4894.363732714724, 4894.706317620812, 4915.066137433948, 4977.178765503724, 5026.070177017264, 5054.4187418447345, 5083.72039537829, 5230.476952304892, 5235.60732945023, 4868.586170175433, 4875.488073752347, 4875.634327425386, 4907.852764417074, 4920.434150072788, 5057.797688092435, 5057.924131138109, 5058.064258112261, 5063.468335824686, 5096.388433388017, 4908.067467181224, 5016.448190698947, 5026.5727413168825, 5132.820351287687, 5138.152204886152, 4870.196417591058, 4894.045661096052, 4959.776810043484, 5002.299678045149, 5010.423801262756, 5013.047520971004, 5034.899302013866, 5035.219540971156, 5037.017781532566, 5084.186530155305, 4587.977060114678, 4945.826896058621, 4950.6782059166035, 4952.826651067339, 4962.156433406401, 4995.350604421402, 5016.924746128884, 5018.222175562793, 5019.498050194951, 5025.195968644999, 4811.927821082757, 4876.244182151772, 4877.756112194447, 4905.1416002200185, 4943.555080042814], "unit": "ms", "name": "dojo.html", "value": 4697.651326055086}, {"lowerIsBetter": false, "replicates": [574.84191847242, 575.0913556580603, 580.579080166879, 581.226968132384, 593.0836857055848, 28071.578926316095, 28553.714462855365, 28616.28459288519, 28620.85689571552, 28653.713462865366, 29169.56245656317, 36699.431039827155, 37274.254514909684, 37453.0, 37580.24839503208, 7771.766846994599, 7896.052473703164, 7901.604919754018, 7913.841723165533, 7917.208279172094, 7120.85758284834, 7308.4518661100365, 7785.299323060924, 7888.684452621888, 7888.960555197216, 10155.492225388738, 10396.42819644923, 10399.168066554657, 10400.37597744134, 10404.89595104047, 9955.10404063634, 9999.250056245774, 10050.396976181453, 10086.344387614781, 10089.0, 9875.111239988435, 10027.0, 10046.346987445793, 10050.09549140581, 10056.94971525145, 38530.229395412214, 38982.80508597467, 39032.60967390318, 39059.804700976594, 39170.804145979375, 3032.408680307341, 3075.2773098321877, 3142.308692087737, 3586.1751797086554, 3638.6179451157777, 27250.863745681145, 27744.30639234015, 27780.0, 28034.0, 28109.92406101104, 3490.2844916791996, 3505.3164632896596, 3520.718342532617, 3543.574771027493, 3600.9279814403567, 218740.0, 220540.8972955141, 221292.0, 221466.0, 222376.0, 49042.50957490451, 50033.749831250614, 57049.0, 57586.42413575894, 60433.09350359748, 55871.44128558744, 55949.720251399296, 56167.91076490751, 56226.71886640623, 56275.15587266194, 14499.0, 14586.927065364818, 14659.0, 14673.85326146725, 14691.926540367229, 11417.543298268143, 11505.597304094317, 11507.02190313816, 11509.366984815915, 11517.308961462339, 18900.71648925267, 19109.235630574898, 19154.0, 19158.425247242605, 19181.32865349706, 7576.128745194374, 7807.453478256582, 7839.568823714751, 7896.249856263646, 7918.841623167505, 884.8097659003345, 902.5397047505688, 915.5285028210477, 984.3257368702461, 1050.7320633238476, 27215.319617009733, 30190.245243869078, 31266.374672506423, 31275.687243127733, 31656.208594785316, 899.6356475627381, 958.6644674363916, 1020.7193021919031, 1051.3376572759266, 1067.066316972649, 13632.0, 13830.515931942333, 13886.86113138876, 13901.860981390057, 13973.720525589431, 316218.02691838105, 321815.0, 322423.0, 322488.0, 324110.0, 45411.545884541396, 45890.770546147054, 45913.770431147634, 45941.0, 45975.31037034447, 1194.1581185264367, 1197.0483465644834, 1205.6503613951857, 1206.8129439936824, 1210.6247063410372, 23051.6542251863, 30166.396672066876, 30560.541591876583, 30657.540136897518, 30677.661169415293, 43501.3474797872, 43980.560194398924, 44073.0, 44107.77946110249, 44122.558774411846, 243414.0, 244924.0, 245514.0, 246007.0, 246976.0, 24166.87916560406, 24777.380565485288, 29907.850460747555, 30262.69737302687, 30692.693073068982, 35659.0, 36542.45186322154, 36715.81642091773, 36938.0, 37244.627553724116, 29783.404331913673, 29914.850425747733, 31357.0, 31777.0, 31852.5222121673, 32474.35051299008, 32576.51135232926, 32861.83569082139, 37552.81223593974, 39358.212835743696, 33524.83237583796, 34163.316733665684, 34276.48585271273, 34349.65650343464, 34405.82797085999, 28783.712162878102, 29895.252618684706, 30456.086317410514, 30559.2360190997, 30568.694313056585, 23597.29208123759, 23665.171718989754, 24008.0, 24045.879770601736, 24067.638985415582], "unit": "ms", "name": "ext.html", "value": 17417.513089354637}, {"lowerIsBetter": false, "replicates": [322.20094166467146, 322.4502223708577, 325.347677905799, 343.8985499277713, 345.65779877920863, 12310.384480775947, 12773.808392874114, 14837.0, 15436.61408464789, 15712.45006424774, 14956.401743930257, 15348.10598899513, 16012.759808602881, 16233.918830405832, 16263.51209463715, 4894.3147959285725, 4951.801927922878, 5119.7952081916865, 5123.4108077571, 5125.948740512603, 3616.945745813815, 3730.477733117366, 3733.4026555751084, 3734.3278209922205, 5073.898522029557, 3706.592274849764, 5513.393526712059, 5688.2605261315975, 5694.544436445074, 5699.658020518761, 5507.504324610784, 5641.68970706613, 5654.010548154057, 5670.574706896958, 5673.149027645845, 5095.414027386824, 5112.59099272061, 5114.053900028507, 5116.283720279164, 5117.104506711348, 18987.43037708871, 19297.131629076586, 19507.609847802963, 19558.413247602595, 19633.31283405074, 1856.907154642276, 1933.5939452714947, 1939.4084804134734, 2045.8261047810954, 2078.532330225702, 12438.253704777651, 12669.239845609292, 12768.170068945488, 12835.0, 13068.934655326757, 1698.269744010075, 1723.6121872578694, 1730.809610942808, 1761.181050811366, 1804.124999375302, 50682.0, 51722.0, 53960.0, 54659.72670136624, 55475.44524554743, 8476.576171191417, 8965.910340896507, 9775.560099795384, 9848.0, 9856.211503079736, 12466.065045121652, 12466.314352710688, 12475.189112707645, 12483.06377021727, 12488.875111248954, 6870.45036397087, 6877.58734475933, 6885.449164066863, 6911.343422374866, 6960.060391847036, 6465.0, 6506.479481641457, 6516.6415847128865, 6551.967240163769, 6562.934370656328, 3753.849846006129, 3788.261289048609, 3788.962110378916, 4113.753174809521, 4213.073123912795, 1555.1058141568644, 1604.1017030462979, 1610.549046267047, 1691.8223586523484, 1736.5658585353663, 838.9244967952792, 863.4905405810601, 913.3743385780629, 925.6112432778249, 939.262678797141, 15137.243137843285, 15743.13412762309, 16133.112678802778, 16398.918005409898, 16472.588185295223, 775.464929198851, 828.0849661124371, 874.2306770042322, 885.6944354197921, 934.3226161033197, 8953.373263871466, 9079.863802042975, 9130.223930965942, 9225.07749225072, 9337.486438245825, 471140.0, 476913.0, 495598.0, 497160.0, 500152.0, 70769.64615176892, 71125.64437177885, 72546.63726681333, 72795.63602181955, 73189.63405183046, 1101.8347247912716, 1102.3606308341143, 1107.6621630402644, 1118.1725523112839, 1119.4738472917716, 14818.333175007367, 14976.101433914, 15072.321745521696, 15072.54782356531, 15330.156841373831, 32143.35713285768, 32147.839260803546, 32524.67475325311, 32643.673563264063, 32952.67047329496, 42149.789251053546, 42845.78577107094, 42921.0, 43275.0, 46672.533274668174, 8989.910100898907, 9115.0, 9242.0, 9245.445273283625, 9354.859677104985, 16227.107509086642, 16492.42276520316, 16544.66910661804, 16617.50147495577, 16844.07357595295, 13251.0, 13392.799108013582, 13832.86167138356, 14089.506867260006, 14234.928825355806, 12394.442250098587, 12475.438605262967, 13638.863611363759, 13784.724305513633, 13876.375563099482, 10124.84812727795, 12660.873391266337, 12937.417816198482, 13138.605841824761, 13635.113717608323, 8757.47455152693, 8878.334124940526, 8982.910170898207, 8990.415622984485, 9008.684696035607, 12106.334151621746, 12290.877091228973, 12414.317212553397, 13092.14901031468, 13419.530316438877], "unit": "ms", "name": "jquery.html", "value": 8311.073536596903}, {"lowerIsBetter": false, "replicates": [1462.9634259143513, 1654.437491252974, 1668.3076523242855, 1723.6816481831931, 1730.9307627694889, 6153.0, 6805.897911531331, 6924.446044316455, 6934.341237582435, 6940.479464040204, 7118.2881711828795, 7224.783256502314, 7232.7830165095, 7241.710331586743, 7262.20115787263, 1748.4754573627924, 1777.395685466941, 2029.3708950225441, 2057.989710051455, 2082.2920207129573, 2111.3032699209302, 2117.8623389479712, 2120.4380839077658, 2122.066290832037, 2129.606022885763, 2036.9898150509227, 2082.1255072869358, 2107.104480595741, 2113.894305284737, 2114.513661857766, 1755.991220043898, 1811.0763510609552, 2019.0611365714867, 2070.0477780221117, 2074.025208152166, 2110.6728457089175, 2115.1962254343252, 2133.7332833395826, 2135.530183359658, 2135.690324902896, 7244.8551028979655, 7277.8544429111125, 7299.051123353983, 7299.89050164248, 7306.744263950789, 4321.67587430944, 4401.713888597263, 4409.955900440987, 4432.3794668746405, 4433.334999750031, 2833.6741274753463, 2845.132234668425, 2884.7403733664073, 2890.075175943678, 2994.1766014346013, 876.9693060742843, 896.3277541843618, 921.4655499810161, 925.3522534226001, 1695.2117265471616, 9556.0, 9572.090651388176, 9614.951925240399, 9622.085901839315, 9633.855492167622, 3948.2103579284258, 4011.4584531088512, 4046.7252815363067, 4054.8175332110127, 4098.077932465171, 8080.111187769341, 8085.595720213966, 8112.513249205066, 8116.513009219466, 8136.918630813616, 4372.1692878353015, 4387.802548885308, 4441.244988351923, 4442.044960333479, 4445.799939002753, 4068.613481719232, 4080.6327430531396, 4083.0404854859084, 4086.734362266443, 4087.816048277835, 3164.7784655074383, 3195.185227766951, 3215.93874021577, 3242.302904875416, 3246.577944867199, 961.8461046232709, 981.9116279534733, 985.1527686189871, 985.6845809341086, 994.2791476179856, 1132.7621199548023, 1143.7998350288667, 1152.4295473740385, 1158.5134243617701, 1161.4831400026908, 6725.2602213756445, 6752.864942701119, 6753.45972322213, 6764.594124352555, 6799.354061364163, 443.864621290503, 454.79534209605146, 455.0285141223446, 457.61331674734794, 463.4276668314629, 5370.892582148335, 5424.105022671294, 5426.050441172779, 5427.402985671573, 5432.538234250054, 8528.65885364591, 8655.740327790176, 8656.78358041054, 8684.956575217084, 8904.59929303183, 7984.40116991228, 8047.718329858427, 8117.188281171953, 8120.3503719702285, 8135.023797144262, 6797.116374871235, 6817.488688348394, 6888.41448476885, 6936.514443988873, 6943.132108486439, 6871.896921546281, 6939.375456208763, 6960.37356637905, 6965.373116419547, 6968.014115976922, 7747.767566973, 7878.684852605831, 7908.84182316362, 8025.317847982987, 8026.638801253841, 8014.479058861155, 8030.478018928751, 8098.83802323962, 8238.052623948322, 8247.134050924567, 6220.782272620437, 6241.96879015602, 6319.778807741707, 6332.176817013758, 6495.253045899593, 6845.212800528003, 6873.621950792754, 7012.544184627983, 7027.086478757728, 7069.823254418475, 6427.1002059710745, 6469.320721324193, 6595.769148079794, 6669.899951500634, 6760.0, 5623.297087864017, 6306.716197771019, 6360.745570177141, 6445.484361250995, 6486.4486518646445, 6346.333634968262, 6386.712597933197, 6391.265004524539, 6392.0731493934045, 6405.103285540122, 5385.27298814655, 5433.483819037185, 5434.972825135849, 5442.319710036246, 5443.727813609383, 6160.13758073861, 6188.845278868064, 6195.907061393992, 6196.566240363131, 6196.876062478816], "unit": "ms", "name": "mootools.html", "value": 4060.0116996144106}, {"lowerIsBetter": false, "replicates": [312.5296428874544, 313.17322269209285, 323.0470113166159, 327.04176762087104, 327.48421236552434, 5362.008028514728, 5425.7287135643255, 5471.234027236185, 5504.779808807642, 5505.449455054492, 5387.488188622085, 5410.675359478434, 5414.972925135378, 5415.323084614423, 5415.350157981048, 4003.799810009488, 4108.712390132692, 4126.5254495732925, 4208.936865947013, 4212.7472351659, 4210.789460526977, 4217.599328063829, 4242.766647834368, 4250.511191213003, 4252.468441444819, 4185.832566697329, 4197.286461301586, 4203.97002734329, 4211.789410529476, 4214.36784482327, 3985.9601403986026, 4086.1010577672864, 4103.958960410402, 4158.08522125132, 4213.30480470722, 3720.8325625346924, 3728.9627103728885, 3729.4778730977687, 3738.327101121797, 3740.4576336431337, 5168.586513078944, 5182.404023537266, 5184.429712731597, 5187.533122019036, 5189.273501709764, 4868.391451068616, 4869.756512174413, 4872.293517439952, 4874.585660218886, 4877.951220487821, 5553.389517040094, 5644.153376993443, 5682.090865461506, 5690.317161940594, 5698.6865722385255, 4039.8586049488126, 4044.5955404459614, 4044.858429954967, 4045.41341505483, 4051.4733084699096, 5969.940300596982, 5973.342932277446, 5977.521798256173, 5983.0, 5984.551158663117, 4152.584741525823, 4161.979190104091, 4163.188178305262, 4164.937525937114, 4165.500139983161, 4004.2992476316526, 4125.030617804813, 4128.649064829463, 4131.690123240769, 4211.052513184509, 4715.882102947385, 4757.215059515211, 4786.569208771228, 4787.8563643090765, 4790.592799612072, 5681.0910254359105, 5684.403137670568, 5698.2592263005545, 5708.229389032511, 5709.600327977002, 1443.949461768854, 1472.1829384691384, 1473.690524989764, 1473.9705205895823, 1474.0492382413497, 962.2013728605241, 970.7219316682034, 991.9305648604528, 991.9950400247952, 1000.6997900629782, 4945.109880221595, 4945.703257804544, 4951.183054795918, 4952.108620448282, 4953.331300274489, 5881.088431293157, 5888.646681199141, 5895.616784908967, 5896.3219229788265, 5898.203742494708, 4933.45731969483, 4938.802447902043, 4943.431505376856, 4945.23348880924, 4952.331435256195, 3006.2784931616256, 3059.2657762137374, 3068.969310306913, 3121.843907804601, 3156.2425017995974, 5535.169724541351, 5616.157576363578, 5616.606837521416, 5632.802851900164, 5640.407757185437, 6107.389261073857, 6109.358517355702, 6115.113308570321, 6116.510679145657, 6117.082437634391, 5615.8876822464135, 5621.971890140523, 5624.987502249634, 5625.409332020243, 5625.493705566519, 5752.827415177551, 5923.289205295392, 5931.495822854933, 5931.911021334769, 5934.554908381802, 5820.883582328414, 5822.475977162076, 5824.94175058244, 5825.417458254141, 5828.154917537018, 5604.159376093456, 5613.635113717595, 5615.691136987505, 5620.100783874561, 5623.746931388016, 3992.401139829049, 4104.138130992525, 4107.199096176337, 4111.938320925248, 4128.195001974706, 5916.3492015877355, 5924.585279030426, 5931.940680593311, 5936.762529498945, 5938.376470470538, 5676.68778217202, 5693.117566777156, 5693.914591281217, 5694.487496125203, 5695.487406133468, 5536.474034966672, 5681.926096974492, 5685.090385538294, 5686.289213848269, 5689.630174038674, 5541.418151094238, 5560.805371811967, 5563.248961390161, 5580.358258800127, 5586.0, 5735.025045742317, 5751.568632352674, 5751.654900705971, 5757.050086735641, 5760.740766665594, 5384.730763461889, 5483.698396588226, 5490.972545137249, 5492.917606235989, 5501.779928802803], "unit": "ms", "name": "prototype.html", "value": 4284.514585865152}, {"lowerIsBetter": false, "replicates": [678.8710145072439, 692.8822100242959, 766.5285849202738, 780.3172224303738, 801.2108073547556, 11344.546218151274, 11524.020458261037, 11567.768644627102, 11736.882631173687, 11791.941040294809, 10575.36547807132, 11580.942095289533, 12190.146689731722, 12194.085443591744, 12203.084768642366, 599.5802937943424, 775.2906090926796, 788.3496115704538, 789.1950210784996, 789.5183937797939, 779.6959185917468, 794.3486341200218, 795.2842441802367, 795.2882170457437, 795.5862951265339, 638.955273130881, 644.1304239276985, 776.7669699090278, 810.3031393002013, 815.0789607743271, 822.416084579943, 825.4634487583058, 825.471698113208, 825.5830805443272, 827.2843989948681, 609.1137395090177, 610.2585358789048, 610.6153123532147, 610.9755609775603, 611.1382950040467, 12008.459619317151, 12285.57000504978, 12303.75392492154, 12330.5067797288, 12332.630021099381, 11556.59551915679, 12023.218490798157, 12344.938275308656, 12355.814662780065, 12638.304893230868, 9073.274138068939, 9091.590878410487, 9135.497547634877, 9172.174504294646, 9190.126937940884, 3179.0939582218957, 3276.2300859298048, 3277.049655599873, 3284.5237440571223, 3335.7664963452567, 42647.786761065996, 42987.35518967218, 42989.35515967263, 42994.0, 42998.785006074766, 9337.112974267433, 9460.621575136918, 9529.094736000068, 9568.521573921276, 9665.90334096664, 17296.135193240538, 17452.040137792545, 17525.47423577295, 17538.561535961704, 17544.29822807099, 6333.809985700436, 6388.680565971683, 6461.353864613501, 6484.967575162094, 6567.737290508422, 3333.1667083229195, 3384.627690953993, 3415.7267418606452, 3554.608993010767, 3568.3398571264397, 2687.261003224129, 2745.3960128771637, 2745.8215216010894, 2746.231055304518, 2749.1065403743864, 467.7707923117716, 487.6927535652516, 492.13875717494386, 495.26453216972766, 504.19329073482135, 500.87227756921754, 524.2634099090784, 529.4467281690643, 567.5686478276457, 574.5805561939808, 7048.682809273595, 7063.82340441493, 7133.429325654039, 7228.38558722504, 8230.8353832923, 480.16930709872116, 499.30845778596904, 569.3566270114744, 571.7970120607208, 573.526840356699, 3396.3207358528393, 3551.964480355215, 3587.6232995535092, 3607.6572725591027, 3688.280785246851, 50840.49159508431, 51209.743951280005, 51354.74322628438, 51362.0, 51515.48484515182, 40419.7979010109, 40420.79789601033, 40453.595464044985, 40582.39126413106, 40647.18705625871, 41883.7905810469, 41935.790321048196, 42093.15813683709, 42565.148697025885, 42980.78509607369, 7768.223177682186, 8094.676212951416, 8143.267105960492, 8204.83590328178, 8349.749507514784, 31387.21531961628, 31909.20226994344, 31913.042608721775, 32160.0, 32395.51406728854, 36635.26729465449, 36833.0, 37123.25753484969, 41335.1732965345, 41491.58508414877, 9344.859827102462, 10020.749481263027, 10121.645742399276, 10139.847902281324, 10195.111810649458, 11158.274712143684, 11603.0, 11658.18392712502, 11733.413329333669, 11940.52237910474, 10244.385336879513, 10321.638742644272, 10390.324628899098, 10835.945820270848, 10852.782944341227, 10766.515506802369, 10805.945970270099, 10813.783724325313, 10867.619633312795, 11097.223194376316, 8002.359811214972, 9147.908520914973, 9710.271729620448, 9907.702768916944, 9953.203743700342, 8853.247473964528, 9250.768730781785, 9369.109934556207, 9403.106704863027, 9691.70924872255, 9031.187193152648, 9358.485283309483, 9488.762780930532, 9502.904970950201, 9511.809763804547], "unit": "ms", "name": "yui.html", "value": 5691.966882235241}], "name": "dromaeo_css", "value": 6378.376854131785}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 115.0, 107.0, 112.0, 112.0, 111.0, 101.0, 113.0, 103.0, 111.0], "unit": "ms", "name": "ai-astar", "value": 109.5}, {"lowerIsBetter": true, "replicates": [156.0, 130.0, 151.0, 167.0, 131.0, 152.0, 158.0, 129.0, 173.0, 132.0], "unit": "ms", "name": "audio-beat-detection", "value": 147.9}, {"lowerIsBetter": true, "replicates": [162.0, 163.0, 161.0, 163.0, 162.0, 162.0, 164.0, 164.0, 161.0, 161.0], "unit": "ms", "name": "audio-dft", "value": 162.3}, {"lowerIsBetter": true, "replicates": [74.0, 73.0, 82.0, 101.0, 72.0, 73.0, 73.0, 105.0, 89.0, 72.0], "unit": "ms", "name": "audio-fft", "value": 81.4}, {"lowerIsBetter": true, "replicates": [91.0, 92.0, 124.0, 91.0, 92.0, 91.0, 127.0, 91.0, 91.0, 123.0], "unit": "ms", "name": "audio-oscillator", "value": 101.3}, {"lowerIsBetter": true, "replicates": [109.0, 109.0, 109.0, 110.0, 109.0, 110.0, 109.0, 110.0, 109.0, 109.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.3}, {"lowerIsBetter": true, "replicates": [146.0, 147.0, 146.0, 147.0, 147.0, 147.0, 146.0, 147.0, 146.0, 147.0], "unit": "ms", "name": "imaging-darkroom", "value": 146.6}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0, 95.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.1}, {"lowerIsBetter": true, "replicates": [68.0, 68.0, 69.0, 69.0, 72.0, 68.0, 70.0, 78.0, 66.0, 66.0], "unit": "ms", "name": "json-parse-financial", "value": 69.4}, {"lowerIsBetter": true, "replicates": [68.0, 68.0, 68.0, 69.0, 69.0, 69.0, 70.0, 69.0, 69.0, 68.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 68.7}, {"lowerIsBetter": true, "replicates": [81.0, 84.0, 85.0, 83.0, 84.0, 83.0, 84.0, 84.0, 83.0, 83.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 83.4}, {"lowerIsBetter": true, "replicates": [124.0, 128.0, 128.0, 129.0, 132.0, 120.0, 125.0, 121.0, 129.0, 121.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 125.7}, {"lowerIsBetter": true, "replicates": [146.0, 144.0, 145.0, 144.0, 151.0, 135.0, 143.0, 142.0, 142.0, 136.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 142.8}, {"lowerIsBetter": true, "replicates": [70.0, 69.0, 71.0, 69.0, 71.0, 70.0, 68.0, 71.0, 70.0, 71.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 70.0}], "name": "kraken", "value": 1513.4}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [162.86644951140065], "unit": "score", "name": "Richards", "value": 216.75427999999994}, {"lowerIsBetter": false, "replicates": [191.9754271453254], "unit": "score", "name": "DeltaBlue", "value": 344.4086619999998}, {"lowerIsBetter": false, "replicates": [281.29395218002816], "unit": "score", "name": "Encrypt", "value": 946.2734550000002}, {"lowerIsBetter": false, "replicates": [5081.218274111675], "unit": "score", "name": "Decrypt", "value": 52.38527172827171}, {"lowerIsBetter": false, "replicates": [1976.2845849802372], "unit": "score", "name": "RayTrace", "value": 374.434434}, {"lowerIsBetter": false, "replicates": [792.3930269413629], "unit": "score", "name": "Earley", "value": 841.0763060000003}, {"lowerIsBetter": false, "replicates": [11952.380952380952], "unit": "score", "name": "Boyer", "value": 55.75985258964142}, {"lowerIsBetter": false, "replicates": [27052.63157894737], "unit": "score", "name": "RegExp", "value": 33.67454280155639}, {"lowerIsBetter": false, "replicates": [621.5040397762585], "unit": "score", "name": "Splay", "value": 131.11901899999998}, {"lowerIsBetter": false, "replicates": [4826.923076923077], "unit": "score", "name": "NavierStokes", "value": 307.4422310756973}], "name": "v8_7", "value": 19780.502059015413}]} 15:33:02 INFO - RETURN: dromaeo_css: 6378.37 15:33:02 INFO - RETURN: kraken: 1513.40 15:33:02 INFO - RETURN: v8_7: 19780.50 15:33:02 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,35]]", "result": "19780.50"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,35]]", "result": "1513.40"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,35]]", "result": "6378.37"}}} 15:33:02 INFO - Return code: 0 15:33:02 INFO - # TBPL SUCCESS # 15:33:02 INFO - Running post-action listener: _resource_record_post_action 15:33:02 INFO - Running post-run listener: _resource_record_post_run 15:33:03 INFO - Total resource usage - Wall time: 1233s; CPU: 13.0%; Read bytes: 4096; Write bytes: 499146752; Read time: 12; Write time: 485796 15:33:03 INFO - install - Wall time: 14s; CPU: 16.0%; Read bytes: 0; Write bytes: 215068672; Read time: 0; Write time: 314396 15:33:03 INFO - run-tests - Wall time: 1219s; CPU: 13.0%; Read bytes: 0; Write bytes: 284078080; Read time: 0; Write time: 171400 15:33:03 INFO - Running post-run listener: _upload_blobber_files 15:33:03 INFO - Blob upload gear active. 15:33:03 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 15:33:03 INFO - Copying logs to upload dir... 15:33:03 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1282.702462 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 22 secs) (at 2015-11-19 15:33:03.551061) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-19 15:33:03.554161) ========= 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=6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009965 build_url: 'https://queue.taskcluster.net/v1/task/S9Q1GSsSQ_KJ0zjyiAMQUQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-19 15:33:03.604396) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 15:33:03.604725) ========= 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=6ea65ccfe4e6b94e0d4f826f000001d8-1447974698.407788-1949404951 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004639 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-19 15:33:03.654974) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-19 15:33:03.655322) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-19 15:33:03.655655) ========= ========= Total master_lag: 0.22 =========