builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-042 starttime: 1447812875.41 results: success (0) buildid: 20151117174636 builduid: 6d6eca329e8844ea8873cd34412239eb revision: 13ccab8d10bb6f6af421d1a5f95431df60bc3572 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.412826) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.413304) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.413647) ========= 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=c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006573 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.437943) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.438234) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.451306) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.451599) ========= 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=c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004674 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.505149) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.505411) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.505735) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.506002) ========= 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=c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-17 18:14:35-- 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% 36.0M=0s 2015-11-17 18:14:35 (36.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.196451 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.719530) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.719836) ========= 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=c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016835 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:35.771303) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-17 18:14:35.771610) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 13ccab8d10bb6f6af421d1a5f95431df60bc3572 --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 13ccab8d10bb6f6af421d1a5f95431df60bc3572 --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=c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-17 18:14:35,982 truncating revision to first 12 chars 2015-11-17 18:14:35,982 Setting DEBUG logging. 2015-11-17 18:14:35,982 attempt 1/10 2015-11-17 18:14:35,982 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/13ccab8d10bb?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-17 18:14:36,993 unpacking tar archive at: fx-team-13ccab8d10bb/testing/mozharness/ program finished with exit code 0 elapsedTime=1.340233 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2015-11-17 18:14:37.125161) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:37.125471) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:37.135187) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:37.135703) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-17 18:14:37.136085) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2015-11-17 18:14:37.136365) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:14:37 INFO - MultiFileLogger online at 20151117 18:14:37 in /builds/slave/test 18:14:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --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 18:14:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:14:37 INFO - {'append_to_log': False, 18:14:37 INFO - 'base_work_dir': '/builds/slave/test', 18:14:37 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 18:14:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:14:37 INFO - 'branch': 'Fx-Team-Non-PGO', 18:14:37 INFO - 'buildbot_json_path': 'buildprops.json', 18:14:37 INFO - 'config_files': ('talos/linux_config.py',), 18:14:37 INFO - 'default_actions': ('clobber', 18:14:37 INFO - 'read-buildbot-config', 18:14:37 INFO - 'download-and-extract', 18:14:37 INFO - 'populate-webroot', 18:14:37 INFO - 'create-virtualenv', 18:14:37 INFO - 'install', 18:14:37 INFO - 'run-tests'), 18:14:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:14:37 INFO - 'download_minidump_stackwalk': True, 18:14:37 INFO - 'download_symbols': 'ondemand', 18:14:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:14:37 INFO - 'tooltool.py': '/tools/tooltool.py', 18:14:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:14:37 INFO - '/tools/misc-python/virtualenv.py')}, 18:14:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:14:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:14:37 INFO - 'installer_path': 'installer.exe', 18:14:37 INFO - 'log_level': 'info', 18:14:37 INFO - 'log_name': 'talos', 18:14:37 INFO - 'log_to_console': True, 18:14:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:14:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:14:37 INFO - 'opt_config_files': (), 18:14:37 INFO - 'pip_index': False, 18:14:37 INFO - 'sps_profile': False, 18:14:37 INFO - 'sps_profile_interval': 0, 18:14:37 INFO - 'suite': 'dromaeojs-e10s', 18:14:37 INFO - 'system_bits': '64', 18:14:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:14:37 INFO - 'title': 'talos-linux64-ix-042', 18:14:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:14:37 INFO - 'use_talos_json': True, 18:14:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:14:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:14:37 INFO - 'work_dir': 'build'} 18:14:37 INFO - ##### 18:14:37 INFO - ##### Running clobber step. 18:14:37 INFO - ##### 18:14:37 INFO - Running pre-action listener: _resource_record_pre_action 18:14:37 INFO - Running main action method: clobber 18:14:37 INFO - rmtree: /builds/slave/test/build 18:14:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:14:37 INFO - Running post-action listener: _resource_record_post_action 18:14:37 INFO - ##### 18:14:37 INFO - ##### Running read-buildbot-config step. 18:14:37 INFO - ##### 18:14:37 INFO - Running pre-action listener: _resource_record_pre_action 18:14:37 INFO - Running main action method: read_buildbot_config 18:14:37 INFO - Using buildbot properties: 18:14:37 INFO - { 18:14:37 INFO - "properties": { 18:14:37 INFO - "buildnumber": 690, 18:14:37 INFO - "product": "firefox", 18:14:37 INFO - "script_repo_revision": "production", 18:14:37 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 18:14:37 INFO - "repository": "", 18:14:37 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 18:14:37 INFO - "buildid": "20151117174636", 18:14:37 INFO - "slavename": "talos-linux64-ix-042", 18:14:37 INFO - "pgo_build": "False", 18:14:37 INFO - "basedir": "/builds/slave/test", 18:14:37 INFO - "project": "", 18:14:37 INFO - "platform": "ubuntu64_hw", 18:14:37 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 18:14:37 INFO - "slavebuilddir": "test", 18:14:37 INFO - "scheduler": "tests-fx-team-linux64-talos", 18:14:37 INFO - "branch": "fx-team", 18:14:37 INFO - "repo_path": "integration/fx-team", 18:14:37 INFO - "stage_platform": "linux64", 18:14:37 INFO - "builduid": "6d6eca329e8844ea8873cd34412239eb", 18:14:37 INFO - "revision": "13ccab8d10bb6f6af421d1a5f95431df60bc3572" 18:14:37 INFO - }, 18:14:37 INFO - "sourcestamp": { 18:14:37 INFO - "repository": "", 18:14:37 INFO - "hasPatch": false, 18:14:37 INFO - "project": "", 18:14:37 INFO - "branch": "fx-team-linux64-talos", 18:14:37 INFO - "changes": [ 18:14:37 INFO - { 18:14:37 INFO - "category": null, 18:14:37 INFO - "files": [ 18:14:37 INFO - { 18:14:37 INFO - "url": null, 18:14:37 INFO - "name": "https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 18:14:37 INFO - } 18:14:37 INFO - ], 18:14:37 INFO - "repository": "", 18:14:37 INFO - "rev": "13ccab8d10bb6f6af421d1a5f95431df60bc3572", 18:14:37 INFO - "who": "mhammond@skippinet.com.au", 18:14:37 INFO - "when": 1447812820, 18:14:37 INFO - "number": 6675335, 18:14:37 INFO - "comments": "Bug 1225194 - hook up remotetab action to tabs from other devices are actually opened. r=mak", 18:14:37 INFO - "project": "", 18:14:37 INFO - "at": "Tue 17 Nov 2015 18:13:40", 18:14:37 INFO - "branch": "fx-team-linux64-talos", 18:14:37 INFO - "revlink": "", 18:14:37 INFO - "properties": [ 18:14:37 INFO - [ 18:14:37 INFO - "buildid", 18:14:37 INFO - "20151117174636", 18:14:37 INFO - "Change" 18:14:37 INFO - ], 18:14:37 INFO - [ 18:14:37 INFO - "builduid", 18:14:37 INFO - "6d6eca329e8844ea8873cd34412239eb", 18:14:37 INFO - "Change" 18:14:37 INFO - ], 18:14:37 INFO - [ 18:14:37 INFO - "pgo_build", 18:14:37 INFO - "False", 18:14:37 INFO - "Change" 18:14:37 INFO - ] 18:14:37 INFO - ], 18:14:37 INFO - "revision": "13ccab8d10bb6f6af421d1a5f95431df60bc3572" 18:14:37 INFO - } 18:14:37 INFO - ], 18:14:37 INFO - "revision": "13ccab8d10bb6f6af421d1a5f95431df60bc3572" 18:14:37 INFO - } 18:14:37 INFO - } 18:14:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 18:14:37 INFO - Running post-action listener: _resource_record_post_action 18:14:37 INFO - ##### 18:14:37 INFO - ##### Running download-and-extract step. 18:14:37 INFO - ##### 18:14:37 INFO - Running pre-action listener: _resource_record_pre_action 18:14:37 INFO - Running main action method: download_and_extract 18:14:37 INFO - mkdir: /builds/slave/test/build/tests 18:14:37 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')]} 18:14:37 INFO - https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 18:14:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/test_packages.json 18:14:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/test_packages.json 18:14:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 18:14:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 18:14:39 INFO - Downloaded 1302 bytes. 18:14:39 INFO - Reading from file /builds/slave/test/build/test_packages.json 18:14:39 INFO - Using the following test package requirements: 18:14:39 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 18:14:39 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:14:39 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 18:14:39 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:14:39 INFO - u'jsshell-linux-x86_64.zip'], 18:14:39 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:14:39 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 18:14:39 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 18:14:39 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:14:39 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 18:14:39 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:14:39 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 18:14:39 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:14:39 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 18:14:39 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 18:14:39 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 18:14:39 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 18:14:39 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 18:14:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:14:39 INFO - https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:14:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:14:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:14:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/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 18:14:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/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 18:14:41 INFO - Downloaded 21277682 bytes. 18:14:41 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 18:14:41 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:14:41 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 18:14:42 INFO - Return code: 0 18:14:42 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 18:14: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')]} 18:14:42 INFO - https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:14:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:14:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:14:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/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 18:14:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/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 18:14:44 INFO - Downloaded 21277682 bytes. 18:14:44 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 18:14:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 18:14:44 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 18:14:46 INFO - Return code: 0 18:14:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:14:46 INFO - https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 18:14:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 18:14:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 18:14:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/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 18:14:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/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 18:14:47 INFO - Downloaded 11131693 bytes. 18:14:47 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 18:14:47 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 18:14:47 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 18:14:47 INFO - Return code: 0 18:14: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')]} 18:14:47 INFO - https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 18:14:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 18:14:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 18:14:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/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 18:14:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dXRb6yFRTp6THeRzLXYWGA/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 18:14:48 INFO - Downloaded 55658772 bytes. 18:14:48 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 18:14:48 INFO - mkdir: /builds/slave/test/properties 18:14:48 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:14:48 INFO - Writing to file /builds/slave/test/properties/build_url 18:14:48 INFO - Contents: 18:14:48 INFO - build_url:https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 18:14:48 INFO - Running post-action listener: _resource_record_post_action 18:14:48 INFO - Running post-action listener: set_extra_try_arguments 18:14:48 INFO - ##### 18:14:48 INFO - ##### Running populate-webroot step. 18:14:48 INFO - ##### 18:14:48 INFO - Running pre-action listener: _resource_record_pre_action 18:14:48 INFO - Running main action method: populate_webroot 18:14:48 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:14:48 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:14:48 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 18:14:48 INFO - '../fennec_ids.txt'], 18:14:48 INFO - 'tests': ['tcheck2']}, 18:14:48 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:14:48 INFO - '--tppagecycles', 18:14:48 INFO - '7'], 18:14:48 INFO - 'tests': ['tsvgm']}}, 18:14:48 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 18:14:48 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 18:14:48 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:14:48 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 18:14:48 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 18:14:48 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 18:14:48 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:14:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:14:48 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:14:48 INFO - 'talos_options': ['--e10s'], 18:14:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:14:48 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:14:48 INFO - 'tests': ['damp', 'tps']}, 18:14:48 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:14:48 INFO - 'talos_options': ['--e10s'], 18:14:48 INFO - 'tests': ['damp', 'tps']}, 18:14:48 INFO - 'g3': {'tests': ['dromaeo_dom']}, 18:14:48 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:14:48 INFO - 'other': {'tests': ['a11yr', 18:14:48 INFO - 'ts_paint', 18:14:48 INFO - 'tpaint', 18:14:48 INFO - 'sessionrestore', 18:14:48 INFO - 'sessionrestore_no_auto_restore']}, 18:14:48 INFO - 'other-e10s': {'talos_options': ['--e10s'], 18:14:48 INFO - 'tests': ['a11yr', 18:14:48 INFO - 'ts_paint', 18:14:48 INFO - 'tpaint', 18:14:48 INFO - 'sessionrestore', 18:14:48 INFO - 'sessionrestore_no_auto_restore']}, 18:14:48 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 18:14:48 INFO - 'tests': ['a11yr', 18:14:48 INFO - 'ts_paint', 18:14:48 INFO - 'tpaint', 18:14:48 INFO - 'sessionrestore', 18:14:48 INFO - 'sessionrestore_no_auto_restore']}, 18:14:48 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 18:14:48 INFO - 'tests': ['a11yr', 18:14:48 INFO - 'ts_paint', 18:14:48 INFO - 'tpaint', 18:14:48 INFO - 'sessionrestore', 18:14:48 INFO - 'sessionrestore_no_auto_restore']}, 18:14:48 INFO - 'other_l64': {'tests': ['a11yr', 18:14:48 INFO - 'ts_paint', 18:14:48 INFO - 'tpaint', 18:14:48 INFO - 'sessionrestore', 18:14:48 INFO - 'sessionrestore_no_auto_restore']}, 18:14:48 INFO - 'other_nol64': {'tests': ['a11yr', 18:14:48 INFO - 'ts_paint', 18:14:48 INFO - 'tpaint', 18:14:48 INFO - 'sessionrestore', 18:14:48 INFO - 'sessionrestore_no_auto_restore']}, 18:14:48 INFO - 'svgr': {'tests': ['tsvgx', 18:14:48 INFO - 'tsvgr_opacity', 18:14:48 INFO - 'tart', 18:14:48 INFO - 'tscrollx', 18:14:48 INFO - 'cart']}, 18:14:48 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 18:14:48 INFO - 'tests': ['tsvgx', 18:14:48 INFO - 'tsvgr_opacity', 18:14:48 INFO - 'tart', 18:14:48 INFO - 'tscrollx', 18:14:48 INFO - 'cart']}, 18:14:48 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:14:48 INFO - 'tests': ['tp5o']}, 18:14:48 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:14:48 INFO - 'talos_options': ['--e10s'], 18:14:48 INFO - 'tests': ['tp5o']}, 18:14:48 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:14:48 INFO - 'talos_options': ['--xperf_path', 18:14:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:14:48 INFO - 'tests': ['tp5n']}, 18:14:48 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:14:48 INFO - 'talos_options': ['--e10s', 18:14:48 INFO - '--xperf_path', 18:14:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:14:48 INFO - 'tests': ['tp5n']}}, 18:14:48 INFO - 'talos.zip': {'path': '', 18:14:48 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:14:48 INFO - Running post-action listener: _resource_record_post_action 18:14:48 INFO - ##### 18:14:48 INFO - ##### Running create-virtualenv step. 18:14:48 INFO - ##### 18:14:48 INFO - Running pre-action listener: _resource_record_pre_action 18:14:48 INFO - Running main action method: create_virtualenv 18:14:48 INFO - Creating virtualenv /builds/slave/test/build/venv 18:14:48 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 18:14:48 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 18:14:48 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:14:48 INFO - Using real prefix '/usr' 18:14:48 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:14:49 INFO - Installing distribute.............................................................................................................................................................................................done. 18:14:51 INFO - Installing pip.................done. 18:14:51 INFO - Return code: 0 18:14:51 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:14:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:14:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:14:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:14:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:14:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:51 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 0x7f5f396e8c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e7c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f2d9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fbcac0>, '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 0x1fbd9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1fbde50>, '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': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', '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 18:14:51 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 18:14:51 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 18:14:51 INFO - Using env: {'DISPLAY': ':0', 18:14:51 INFO - 'HOME': '/home/cltbld', 18:14:51 INFO - 'LANG': 'en_US.UTF-8', 18:14:51 INFO - 'LANGUAGE': 'en_US:en', 18:14:51 INFO - 'LOGNAME': 'cltbld', 18:14:51 INFO - 'MAIL': '/var/mail/cltbld', 18:14:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:14:51 INFO - 'MOZ_NO_REMOTE': '1', 18:14:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:14:51 INFO - 'NO_EM_RESTART': '1', 18:14:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:14:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:14:51 INFO - 'PWD': '/builds/slave/test', 18:14:51 INFO - 'SHELL': '/bin/bash', 18:14:51 INFO - 'SHLVL': '1', 18:14:51 INFO - 'TERM': 'linux', 18:14:51 INFO - 'TMOUT': '86400', 18:14:51 INFO - 'USER': 'cltbld', 18:14:51 INFO - 'XDG_SESSION_COOKIE': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', 18:14:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:14:51 INFO - '_': '/tools/buildbot/bin/python'} 18:14:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:14:51 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 18:14:51 INFO - Cleaning up... 18:14:51 INFO - Return code: 0 18:14:51 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 18:14:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:14:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:14:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:14:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:14:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:51 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 0x7f5f396e8c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e7c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f2d9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fbcac0>, '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 0x1fbd9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1fbde50>, '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': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', '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 18:14:51 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 18:14:51 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 18:14:51 INFO - Using env: {'DISPLAY': ':0', 18:14:51 INFO - 'HOME': '/home/cltbld', 18:14:51 INFO - 'LANG': 'en_US.UTF-8', 18:14:51 INFO - 'LANGUAGE': 'en_US:en', 18:14:51 INFO - 'LOGNAME': 'cltbld', 18:14:51 INFO - 'MAIL': '/var/mail/cltbld', 18:14:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:14:51 INFO - 'MOZ_NO_REMOTE': '1', 18:14:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:14:51 INFO - 'NO_EM_RESTART': '1', 18:14:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:14:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:14:51 INFO - 'PWD': '/builds/slave/test', 18:14:51 INFO - 'SHELL': '/bin/bash', 18:14:51 INFO - 'SHLVL': '1', 18:14:51 INFO - 'TERM': 'linux', 18:14:51 INFO - 'TMOUT': '86400', 18:14:51 INFO - 'USER': 'cltbld', 18:14:51 INFO - 'XDG_SESSION_COOKIE': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', 18:14:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:14:51 INFO - '_': '/tools/buildbot/bin/python'} 18:14:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:14:51 INFO - Downloading/unpacking psutil>=0.7.1 18:14:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:14:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:14:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:14:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 18:14:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 18:14:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 18:14:53 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 18:14:53 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 18:14:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:14:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:14:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:14:53 INFO - Installing collected packages: psutil 18:14:53 INFO - Running setup.py install for psutil 18:14:53 INFO - building 'psutil._psutil_linux' extension 18:14:53 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 18:14:53 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 18:14:53 INFO - building 'psutil._psutil_posix' extension 18:14:53 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 18:14:53 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 18:14:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:14:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:14:53 INFO - Successfully installed psutil 18:14:53 INFO - Cleaning up... 18:14:53 INFO - Return code: 0 18:14:53 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 18:14:53 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')]} 18:14:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:14:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:53 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')]} 18:14:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:14:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:53 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 0x7f5f396e8c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e7c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f2d9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fbcac0>, '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 0x1fbd9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1fbde50>, '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': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', '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 18:14:53 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 18:14:53 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 18:14:53 INFO - Using env: {'DISPLAY': ':0', 18:14:53 INFO - 'HOME': '/home/cltbld', 18:14:53 INFO - 'LANG': 'en_US.UTF-8', 18:14:53 INFO - 'LANGUAGE': 'en_US:en', 18:14:53 INFO - 'LOGNAME': 'cltbld', 18:14:53 INFO - 'MAIL': '/var/mail/cltbld', 18:14:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:14:53 INFO - 'MOZ_NO_REMOTE': '1', 18:14:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:14:53 INFO - 'NO_EM_RESTART': '1', 18:14:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:14:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:14:53 INFO - 'PWD': '/builds/slave/test', 18:14:53 INFO - 'SHELL': '/bin/bash', 18:14:53 INFO - 'SHLVL': '1', 18:14:53 INFO - 'TERM': 'linux', 18:14:53 INFO - 'TMOUT': '86400', 18:14:53 INFO - 'USER': 'cltbld', 18:14:53 INFO - 'XDG_SESSION_COOKIE': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', 18:14:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:14:53 INFO - '_': '/tools/buildbot/bin/python'} 18:14:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:14:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 18:14:54 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 18:14:54 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 18:14:54 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 18:14:54 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 18:14:54 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 18:14:54 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 18:14:55 INFO - Downloading mozsystemmonitor-0.0.tar.gz 18:14:55 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 18:14:55 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:14:55 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 18:14:55 INFO - Installing collected packages: mozsystemmonitor 18:14:55 INFO - Running setup.py install for mozsystemmonitor 18:14:55 INFO - Successfully installed mozsystemmonitor 18:14:55 INFO - Cleaning up... 18:14:56 INFO - Return code: 0 18:14:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:14:56 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')]} 18:14:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:14:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:56 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')]} 18:14:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:14:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:56 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 0x7f5f396e8c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e7c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f2d9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fbcac0>, '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 0x1fbd9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1fbde50>, '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': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', '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 18:14:56 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 18:14:56 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 18:14:56 INFO - Using env: {'DISPLAY': ':0', 18:14:56 INFO - 'HOME': '/home/cltbld', 18:14:56 INFO - 'LANG': 'en_US.UTF-8', 18:14:56 INFO - 'LANGUAGE': 'en_US:en', 18:14:56 INFO - 'LOGNAME': 'cltbld', 18:14:56 INFO - 'MAIL': '/var/mail/cltbld', 18:14:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:14:56 INFO - 'MOZ_NO_REMOTE': '1', 18:14:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:14:56 INFO - 'NO_EM_RESTART': '1', 18:14:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:14:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:14:56 INFO - 'PWD': '/builds/slave/test', 18:14:56 INFO - 'SHELL': '/bin/bash', 18:14:56 INFO - 'SHLVL': '1', 18:14:56 INFO - 'TERM': 'linux', 18:14:56 INFO - 'TMOUT': '86400', 18:14:56 INFO - 'USER': 'cltbld', 18:14:56 INFO - 'XDG_SESSION_COOKIE': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', 18:14:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:14:56 INFO - '_': '/tools/buildbot/bin/python'} 18:14:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:14:56 INFO - Downloading/unpacking blobuploader==1.2.4 18:14:56 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 18:14:56 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 18:14:56 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 18:14:56 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 18:14:56 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 18:14:56 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 18:14:57 INFO - Downloading blobuploader-1.2.4.tar.gz 18:14:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 18:14:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:14:57 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:14:57 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 18:14:57 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 18:14:57 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 18:14:57 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 18:14:57 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 18:14:57 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 18:14:58 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 18:14:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:14:58 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:14:58 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 18:14:58 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 18:14:58 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 18:14:58 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 18:14:58 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 18:14:58 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 18:14:58 INFO - Downloading docopt-0.6.1.tar.gz 18:14:58 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 18:14:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:14:58 INFO - Installing collected packages: blobuploader, requests, docopt 18:14:58 INFO - Running setup.py install for blobuploader 18:14:58 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:14:58 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:14:58 INFO - Running setup.py install for requests 18:14:59 INFO - Running setup.py install for docopt 18:14:59 INFO - Successfully installed blobuploader requests docopt 18:14:59 INFO - Cleaning up... 18:14:59 INFO - Return code: 0 18:14:59 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:14:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:14:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:14:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:14:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:14:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:14:59 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 0x7f5f396e8c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e7c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f2d9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fbcac0>, '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 0x1fbd9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1fbde50>, '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': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', '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 18:14:59 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 18:14:59 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 18:14:59 INFO - Using env: {'DISPLAY': ':0', 18:14:59 INFO - 'HOME': '/home/cltbld', 18:14:59 INFO - 'LANG': 'en_US.UTF-8', 18:14:59 INFO - 'LANGUAGE': 'en_US:en', 18:14:59 INFO - 'LOGNAME': 'cltbld', 18:14:59 INFO - 'MAIL': '/var/mail/cltbld', 18:14:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:14:59 INFO - 'MOZ_NO_REMOTE': '1', 18:14:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:14:59 INFO - 'NO_EM_RESTART': '1', 18:14:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:14:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:14:59 INFO - 'PWD': '/builds/slave/test', 18:14:59 INFO - 'SHELL': '/bin/bash', 18:14:59 INFO - 'SHLVL': '1', 18:14:59 INFO - 'TERM': 'linux', 18:14:59 INFO - 'TMOUT': '86400', 18:14:59 INFO - 'USER': 'cltbld', 18:14:59 INFO - 'XDG_SESSION_COOKIE': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', 18:14:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:14:59 INFO - '_': '/tools/buildbot/bin/python'} 18:14:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:14:59 INFO - Running setup.py (path:/tmp/pip-6VXyYQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:14:59 INFO - Running setup.py (path:/tmp/pip-vEqb7d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:14:59 INFO - Running setup.py (path:/tmp/pip-2uCB93-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:14:59 INFO - Running setup.py (path:/tmp/pip-BnfhGG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:14:59 INFO - Running setup.py (path:/tmp/pip-gZ0SPH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:14:59 INFO - Running setup.py (path:/tmp/pip-4B4rlx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:14:59 INFO - Running setup.py (path:/tmp/pip-dv5u7z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:14:59 INFO - Running setup.py (path:/tmp/pip-6jF0Br-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:14:59 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:14:59 INFO - Running setup.py (path:/tmp/pip-Ee6y6W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:15:00 INFO - Running setup.py (path:/tmp/pip-lUOKmn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:15:00 INFO - Running setup.py (path:/tmp/pip-MC6C9d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:15:00 INFO - Running setup.py (path:/tmp/pip-C891_Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:15:00 INFO - Running setup.py (path:/tmp/pip-JSjFGM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:15:00 INFO - Running setup.py (path:/tmp/pip-aQ1Zxb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:15:00 INFO - Running setup.py (path:/tmp/pip-01bKfo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:15:00 INFO - Running setup.py (path:/tmp/pip-GZAbP9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:15:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:15:00 INFO - Running setup.py (path:/tmp/pip-SeZHys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:15:00 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:15:00 INFO - Running setup.py install for manifestparser 18:15:00 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:15:00 INFO - Running setup.py install for mozcrash 18:15:00 INFO - Running setup.py install for mozdebug 18:15:00 INFO - Running setup.py install for mozdevice 18:15:01 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Running setup.py install for mozfile 18:15:01 INFO - Running setup.py install for mozhttpd 18:15:01 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Running setup.py install for mozinfo 18:15:01 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Running setup.py install for mozInstall 18:15:01 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Running setup.py install for mozleak 18:15:01 INFO - Running setup.py install for mozlog 18:15:01 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Running setup.py install for moznetwork 18:15:01 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Running setup.py install for mozprocess 18:15:01 INFO - Running setup.py install for mozprofile 18:15:01 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:15:01 INFO - Running setup.py install for mozrunner 18:15:02 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:15:02 INFO - Running setup.py install for mozscreenshot 18:15:02 INFO - Running setup.py install for moztest 18:15:02 INFO - Running setup.py install for mozversion 18:15:02 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:15:02 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:15:02 INFO - Cleaning up... 18:15:02 INFO - Return code: 0 18:15:02 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:15:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:15:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:15:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:15:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:15:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:15:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:15:02 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 0x7f5f396e8c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e7c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f2d9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fbcac0>, '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 0x1fbd9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1fbde50>, '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': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', '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 18:15:02 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 18:15:02 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 18:15:02 INFO - Using env: {'DISPLAY': ':0', 18:15:02 INFO - 'HOME': '/home/cltbld', 18:15:02 INFO - 'LANG': 'en_US.UTF-8', 18:15:02 INFO - 'LANGUAGE': 'en_US:en', 18:15:02 INFO - 'LOGNAME': 'cltbld', 18:15:02 INFO - 'MAIL': '/var/mail/cltbld', 18:15:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:15:02 INFO - 'MOZ_NO_REMOTE': '1', 18:15:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:15:02 INFO - 'NO_EM_RESTART': '1', 18:15:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:15:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:15:02 INFO - 'PWD': '/builds/slave/test', 18:15:02 INFO - 'SHELL': '/bin/bash', 18:15:02 INFO - 'SHLVL': '1', 18:15:02 INFO - 'TERM': 'linux', 18:15:02 INFO - 'TMOUT': '86400', 18:15:02 INFO - 'USER': 'cltbld', 18:15:02 INFO - 'XDG_SESSION_COOKIE': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', 18:15:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:15:02 INFO - '_': '/tools/buildbot/bin/python'} 18:15:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:15:02 INFO - Running setup.py (path:/tmp/pip-R8ttAP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:15:02 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)) 18:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:15:02 INFO - Running setup.py (path:/tmp/pip-Zd6Q92-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:15:02 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)) 18:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:15:02 INFO - Running setup.py (path:/tmp/pip-b7kT4H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:15:02 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)) 18:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:15:02 INFO - Running setup.py (path:/tmp/pip-vuq0mu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:15:02 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)) 18:15:02 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:15:02 INFO - Running setup.py (path:/tmp/pip-mGzNqp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:15:03 INFO - Running setup.py (path:/tmp/pip-mWh7kn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:15:03 INFO - Running setup.py (path:/tmp/pip-6puC1b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:15:03 INFO - Running setup.py (path:/tmp/pip-1PxSSH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:15:03 INFO - Running setup.py (path:/tmp/pip-RfPWZw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:15:03 INFO - Running setup.py (path:/tmp/pip-wUix8l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:15:03 INFO - Running setup.py (path:/tmp/pip-eR3Pd6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:15:03 INFO - Running setup.py (path:/tmp/pip-bQlBxV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:15:03 INFO - Running setup.py (path:/tmp/pip-tvpP_u-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:15:03 INFO - Running setup.py (path:/tmp/pip-aJLlxG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:15:03 INFO - Running setup.py (path:/tmp/pip-1VP4IE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:15:03 INFO - Running setup.py (path:/tmp/pip-pBvi8K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:15:03 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)) 18:15:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:15:03 INFO - Running setup.py (path:/tmp/pip-jHP6IP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:15:03 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)) 18:15:03 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)) 18:15:03 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)) 18:15:03 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)) 18:15:03 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)) 18:15:03 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)) 18:15:03 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:15:03 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 18:15:03 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 18:15:03 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 18:15:03 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 18:15:03 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 18:15:03 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 18:15:05 INFO - Downloading blessings-1.5.1.tar.gz 18:15:05 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 18:15:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:15:05 INFO - Installing collected packages: blessings 18:15:05 INFO - Running setup.py install for blessings 18:15:05 INFO - Successfully installed blessings 18:15:05 INFO - Cleaning up... 18:15:05 INFO - Return code: 0 18:15:05 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:15:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:15:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:15:05 INFO - Reading from file tmpfile_stdout 18:15:05 INFO - Current package versions: 18:15:05 INFO - argparse == 1.2.1 18:15:05 INFO - blessings == 1.5.1 18:15:05 INFO - blobuploader == 1.2.4 18:15:05 INFO - docopt == 0.6.1 18:15:05 INFO - manifestparser == 1.1 18:15:05 INFO - mozInstall == 1.12 18:15:05 INFO - mozcrash == 0.16 18:15:05 INFO - mozdebug == 0.1 18:15:05 INFO - mozdevice == 0.47 18:15:05 INFO - mozfile == 1.2 18:15:05 INFO - mozhttpd == 0.7 18:15:05 INFO - mozinfo == 0.9 18:15:05 INFO - mozleak == 0.1 18:15:05 INFO - mozlog == 3.0 18:15:05 INFO - moznetwork == 0.27 18:15:05 INFO - mozprocess == 0.22 18:15:05 INFO - mozprofile == 0.27 18:15:05 INFO - mozrunner == 6.11 18:15:05 INFO - mozscreenshot == 0.1 18:15:05 INFO - mozsystemmonitor == 0.0 18:15:05 INFO - moztest == 0.7 18:15:05 INFO - mozversion == 1.4 18:15:05 INFO - psutil == 3.1.1 18:15:05 INFO - requests == 1.2.3 18:15:05 INFO - wsgiref == 0.1.2 18:15:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:15:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:15:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:15:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:15:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:15:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:15:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:15:05 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 0x7f5f396e8c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e7c6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1f2d9a0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fbcac0>, '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 0x1fbd9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1fbde50>, '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': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', '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 18:15:05 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 18:15:05 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 18:15:05 INFO - Using env: {'DISPLAY': ':0', 18:15:05 INFO - 'HOME': '/home/cltbld', 18:15:05 INFO - 'LANG': 'en_US.UTF-8', 18:15:05 INFO - 'LANGUAGE': 'en_US:en', 18:15:05 INFO - 'LOGNAME': 'cltbld', 18:15:05 INFO - 'MAIL': '/var/mail/cltbld', 18:15:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:15:05 INFO - 'MOZ_NO_REMOTE': '1', 18:15:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:15:05 INFO - 'NO_EM_RESTART': '1', 18:15:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:15:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:15:05 INFO - 'PWD': '/builds/slave/test', 18:15:05 INFO - 'SHELL': '/bin/bash', 18:15:05 INFO - 'SHLVL': '1', 18:15:05 INFO - 'TERM': 'linux', 18:15:05 INFO - 'TMOUT': '86400', 18:15:05 INFO - 'USER': 'cltbld', 18:15:05 INFO - 'XDG_SESSION_COOKIE': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', 18:15:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:15:05 INFO - '_': '/tools/buildbot/bin/python'} 18:15:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:15:06 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)) 18:15:06 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)) 18:15:06 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)) 18:15:06 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)) 18:15:06 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)) 18:15:06 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)) 18:15:06 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)) 18:15:06 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)) 18:15:06 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)) 18:15:06 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)) 18:15:06 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)) 18:15:06 INFO - Cleaning up... 18:15:06 INFO - Return code: 0 18:15:06 INFO - Running post-action listener: _resource_record_post_action 18:15:06 INFO - Running post-action listener: _start_resource_monitoring 18:15:06 INFO - Starting resource monitoring. 18:15:06 INFO - ##### 18:15:06 INFO - ##### Running install step. 18:15:06 INFO - ##### 18:15:06 INFO - Running pre-action listener: _resource_record_pre_action 18:15:06 INFO - Running main action method: install 18:15:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:15:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:15:06 INFO - Reading from file tmpfile_stdout 18:15:06 INFO - Detecting whether we're running mozinstall >=1.0... 18:15:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:15:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:15:06 INFO - Reading from file tmpfile_stdout 18:15:06 INFO - Output received: 18:15:06 INFO - Usage: mozinstall [options] installer 18:15:06 INFO - Options: 18:15:06 INFO - -h, --help show this help message and exit 18:15:06 INFO - -d DEST, --destination=DEST 18:15:06 INFO - Directory to install application into. [default: 18:15:06 INFO - "/builds/slave/test"] 18:15:06 INFO - --app=APP Application being installed. [default: firefox] 18:15:06 INFO - mkdir: /builds/slave/test/build/application 18:15:06 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'] 18:15:06 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 18:15:20 INFO - Reading from file tmpfile_stdout 18:15:20 INFO - Output received: 18:15:20 INFO - /builds/slave/test/build/application/firefox/firefox 18:15:20 INFO - Running post-action listener: _resource_record_post_action 18:15:20 INFO - ##### 18:15:20 INFO - ##### Running run-tests step. 18:15:20 INFO - ##### 18:15:20 INFO - Running pre-action listener: _resource_record_pre_action 18:15:20 INFO - Running main action method: run_tests 18:15:20 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:15:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:15:20 INFO - Python 2.7.3 18:15:20 INFO - Return code: 0 18:15:20 INFO - grabbing minidump binary from tooltool 18:15:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:15:20 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 0x1fbcac0>, '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 0x1fbd9a0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1fbde50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:15:20 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 18:15:20 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 18:15:20 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:15:20 INFO - Return code: 0 18:15:20 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 18:15:20 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:15:20 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:15:20 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 18:15:20 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:15:20 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-042', '--webServer', 'localhost'] in /builds/slave/test/build 18:15:20 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-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-042 --webServer localhost 18:15:20 INFO - Using env: {'DISPLAY': ':0', 18:15:20 INFO - 'HOME': '/home/cltbld', 18:15:20 INFO - 'LANG': 'en_US.UTF-8', 18:15:20 INFO - 'LANGUAGE': 'en_US:en', 18:15:20 INFO - 'LOGNAME': 'cltbld', 18:15:20 INFO - 'MAIL': '/var/mail/cltbld', 18:15:20 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:15:20 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:15:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:15:20 INFO - 'MOZ_NO_REMOTE': '1', 18:15:20 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:15:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:15:20 INFO - 'NO_EM_RESTART': '1', 18:15:20 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:15:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:15:20 INFO - 'PWD': '/builds/slave/test', 18:15:20 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:15:20 INFO - 'SHELL': '/bin/bash', 18:15:20 INFO - 'SHLVL': '1', 18:15:20 INFO - 'TERM': 'linux', 18:15:20 INFO - 'TMOUT': '86400', 18:15:20 INFO - 'USER': 'cltbld', 18:15:20 INFO - 'XDG_SESSION_COOKIE': 'c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854', 18:15:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:15:20 INFO - '_': '/tools/buildbot/bin/python'} 18:15:20 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-042', '--webServer', 'localhost'] with output_timeout 3600 18:15:21 INFO - mozversion INFO | application_buildid: 20151117174636 18:15:21 INFO - mozversion INFO | application_changeset: 13ccab8d10bb6f6af421d1a5f95431df60bc3572 18:15:21 INFO - mozversion INFO | application_display_name: Nightly 18:15:21 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:15:21 INFO - mozversion INFO | application_name: Firefox 18:15:21 INFO - mozversion INFO | application_remotingname: firefox 18:15:21 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 18:15:21 INFO - mozversion INFO | application_vendor: Mozilla 18:15:21 INFO - mozversion INFO | application_version: 45.0a1 18:15:21 INFO - mozversion INFO | platform_buildid: 20151117174636 18:15:21 INFO - mozversion INFO | platform_changeset: 13ccab8d10bb6f6af421d1a5f95431df60bc3572 18:15:21 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 18:15:21 INFO - mozversion INFO | platform_version: 45.0a1 18:15:21 INFO - 2015-11-17 18:15:21,099 DEBUG : using testdate: 1447812921 18:15:21 INFO - 2015-11-17 18:15:21,099 DEBUG : actual date: 1447812921 18:15:21 INFO - 2015-11-17 18:15:21,187 INFO : starting webserver on 'localhost:51143' 18:15:21 INFO - 2015-11-17 18:15:21,188 INFO : Starting test suite talos-linux64-ix-042.e 18:15:21 INFO - 2015-11-17 18:15:21,189 INFO : Starting test dromaeo_css 18:15:21 INFO - 2015-11-17 18:15:21,189 DEBUG : operating with platform_type : linux_ 18:15:21 INFO - 2015-11-17 18:15:21,189 INFO : Initialising browser for dromaeo_css test... 18:15:21 INFO - 2015-11-17 18:15:21,203 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpuGcIue/profile http://localhost:51143/getInfo.html 18:15:28 INFO - 2015-11-17 18:15:28,190 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 18:15:28 INFO - 2015-11-17 18:15:28,190 DEBUG : BROWSER_OUTPUT: colorDepth:24 18:15:28 INFO - 2015-11-17 18:15:28,190 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 18:15:28 INFO - 2015-11-17 18:15:28,190 DEBUG : BROWSER_OUTPUT: __metrics 18:15:29 INFO - 2015-11-17 18:15:29,405 INFO : Browser initialized. 18:15:29 INFO - 2015-11-17 18:15:29,406 INFO : Running cycle 1/1 for dromaeo_css test... 18:15:29 INFO - 2015-11-17 18:15:29,406 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpuGcIue/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 18:15:41 INFO - 2015-11-17 18:15:41,392 DEBUG : BROWSER_OUTPUT: RSS: Main: 141197312 18:15:41 INFO - 2015-11-17 18:15:41,393 DEBUG : BROWSER_OUTPUT: 18:16:31 INFO - 2015-11-17 18:16:31,061 DEBUG : BROWSER_OUTPUT: 1447812991053 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] 18:18:42 INFO - 2015-11-17 18:18:42,708 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/dromaeo/cssquery-dojo.html (next: http://localhost:51143/tests/dromaeo/cssquery-ext.html) 18:18:43 INFO - 2015-11-17 18:18:43,692 DEBUG : BROWSER_OUTPUT: RSS: Main: 145014784 18:18:43 INFO - 2015-11-17 18:18:43,693 DEBUG : BROWSER_OUTPUT: 18:21:45 INFO - 2015-11-17 18:21:45,600 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/dromaeo/cssquery-ext.html (next: http://localhost:51143/tests/dromaeo/cssquery-jquery.html) 18:21:46 INFO - 2015-11-17 18:21:46,174 DEBUG : BROWSER_OUTPUT: RSS: Main: 142618624 18:21:46 INFO - 2015-11-17 18:21:46,174 DEBUG : BROWSER_OUTPUT: 18:24:47 INFO - 2015-11-17 18:24:47,850 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/dromaeo/cssquery-jquery.html (next: http://localhost:51143/tests/dromaeo/cssquery-mootools.html) 18:24:48 INFO - 2015-11-17 18:24:48,445 DEBUG : BROWSER_OUTPUT: RSS: Main: 141053952 18:24:48 INFO - 2015-11-17 18:24:48,445 DEBUG : BROWSER_OUTPUT: 18:27:50 INFO - 2015-11-17 18:27:50,233 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/dromaeo/cssquery-mootools.html (next: http://localhost:51143/tests/dromaeo/cssquery-prototype.html) 18:27:50 INFO - 2015-11-17 18:27:50,833 DEBUG : BROWSER_OUTPUT: RSS: Main: 140562432 18:27:50 INFO - 2015-11-17 18:27:50,834 DEBUG : BROWSER_OUTPUT: 18:30:53 INFO - 2015-11-17 18:30:53,387 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/dromaeo/cssquery-prototype.html (next: http://localhost:51143/tests/dromaeo/cssquery-yui.html) 18:30:53 INFO - 2015-11-17 18:30:53,996 DEBUG : BROWSER_OUTPUT: RSS: Main: 140505088 18:30:53 INFO - 2015-11-17 18:30:53,996 DEBUG : BROWSER_OUTPUT: 18:33:56 INFO - 2015-11-17 18:33:56,353 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/dromaeo/cssquery-yui.html (next: http://localhost:51143/tests/dromaeo/cssquery-dojo.html) 18:33:56 INFO - 2015-11-17 18:33:56,603 DEBUG : BROWSER_OUTPUT: RSS: Main: 144093184 18:33:56 INFO - 2015-11-17 18:33:56,603 DEBUG : BROWSER_OUTPUT: 18:33:56 INFO - 2015-11-17 18:33:56,603 DEBUG : BROWSER_OUTPUT: __start_tp_report 18:33:56 INFO - 2015-11-17 18:33:56,603 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 18:33:56 INFO - 2015-11-17 18:33:56,604 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 18:33:56 INFO - 2015-11-17 18:33:56,604 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 18:33:56 INFO - 2015-11-17 18:33:56,604 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2712.7694145997584;2761.8895244190235;2790.023491777878;2797.146870204588;2818.661760588729;4636.165490211761;4830.975845120774;4843.515648435159;4869.561739443449;4905.7547122643855;4669.813207471697;4744.4306683198065;4752.310914917335;4782.354382158407;4852.854414367565;4434.246178149722;4492.348609451627;4519.8418055368065;4553.567411095957;4591.9540804592025;4565.703229290102;4588.082383523292;4616.976915115437;4633.582977532022;4678.43858736952;4259.233337999159;4294.828206871737;4425.955740442619;4426.889327766799;4451.888702782424;4451.265541185733;4484.686071974963;4513.7743112844555;4515.006698526319;4533.727976321398;4240.830366785325;4489;4493.056458143794;4496.505384407713;4512.661550383701;4623.2371658676275;4664.230401983668;4726.929096063562;4761.666683332168;4771.832985845479;5216.843494695166;5229.633925625208;5239.580833533346;5242.7640756166065;5287.259783630257;4965.478624744422;5087.720175390352;5262.710550919698;5263.026340127089;5270.92093618596;4691.554302341272;4756.048790241965;4779.235322348408;4808.663393562417;4832.73419961902;5367.463253674601;5380.596455265871;5384.6499977501335;5412.648177868426;5417.187421886749;4876.853694389103;4997.350344455198;5147.6911385317;5166.173412254021;5200.089984252741;5116.437191908887;5120.308758317654;5125.718085505258;5135.281060651511;5166.535011848951;5050.469700681376;5063.518965698253;5068.4424713281505;5073.289739436482;5074.771635276422;4859.222524396079;4914.926276105862;4995.150824359867;5032.949670503322;5065.39215294167;3960.6237407446247;3981.0843505993785;3990.580988996114;3998.280309544252;4029.959700403017;3549.6450354964295;3565.108722819295;3579.0873327301892;3598.460230965376;3603.657652523006;4267.3812297217355;4366.8908277292685;4399.956000440018;4482.731036137777;4509.120721459284;5218.425973142951;5284.867878303073;5296.09966305729;5297.735113244323;5306.151015837525;4325.52419233884;4524.660650451229;4525.864224073283;4532.32015197723;4587.174308624413;4504.369388285642;4535.9773201133785;4609.400777898852;4615.492295847454;4659.487456379796;4928.802847886116;5003.799848006184;5030.647854650139;5031.572316353005;5066.493350664978;4912.410510738734;5091.0836049511445;5310.628256022196;5330.54690351309;5377.865553361197;4787.54518320759;4850.7817148227705;4882.389701287339;4915.287283343967;4939.678920870132;5140.408852981955;5157.045946499909;5158.561522270649;5173.534381905646;5200.037992971161;4940.555350018516;5059.392872855134;5243.947560524346;5245.842624721265;5267.236250743544;4992.700437973734;5080.898382032265;5104.770285337243;5109.131447653834;5138.100832354397;5070.4929507049;5076.263941728503;5084.38987321509;5089.694618322913;5094.337736094284;4678.766061696833;4764.8332308369045;4846.200376937766;4984.352034235526;4998.850034498971;5094.9490505095955;5118.8976220476125;5119.129747942933;5127.974360128175;5136.589072874086;4982.576480999156;4997.450280469073;5002.87492812668;5004.224345226496;5004.924926126038 18:33:56 INFO - 2015-11-17 18:33:56,604 DEBUG : BROWSER_OUTPUT: |1;ext.html;537.0172584170967;542.6662602499464;548.4069064994787;582.5921854701709;588.7409539802488;36272.27455450893;37041.814790926044;37074.258514829686;37130.443043354375;37138.62861371389;40205.396919046165;40651;40793.796031019876;40821.795891020505;40828.38757418641;7891.368690504746;8036.557989310615;8048.074471435772;8079.434439589231;8093.190680931919;7882.093559240703;7995.720149794758;8009;8011.238932301422;8030.7590772276635;7946.16565260648;8031.4377993540475;8051.879221811678;8061.798455038613;8075.838483230332;7765.378769698411;7771.06747190338;7816.8827467588035;7849.01887264092;7855.882161767549;7804.336631386339;7938.285554300141;7959.801004974922;8034.558099304536;8052.677892884278;38591.80704096489;38963;38999.025024374336;39080.21839563221;39192;2751.2434080627786;2753.2153336299057;2790.972090279112;2846.3453405716596;2846.4307138572367;28827.56758648622;29255.70744292551;29338.413231735245;29404.705952940625;29434;2937.5299952007576;2962.244627619943;2992.730654241129;3154.069549482908;3162.762792790527;229991;230054;230416;231606;231746;41912.1617567647;42415;55182.72408637931;56692.43307566954;56920;55933.601659958826;55952.44047559554;56165.15752263719;56196.62820230799;56359;12513.186642868184;12620.81068783969;12654.493820247271;12688.873111268953;12691.492340306284;9106.635734570675;9129.315301352424;9156.267498600097;9162.496062716615;9315.39449935752;18523.44429667112;18778;18932.81067189338;18974.335898243495;19035.904820475807;7603.581803000888;7817.68729250835;7844.568548729874;7915.683372665144;7935.92101055325;783.5886159766169;857.0872021297298;869.7782065573239;897.3449381951212;984.0611907140374;26423.603645945324;26712.59931101035;26762;26879.193624191306;26920.730792691822;893.6425429827991;918.7886786039248;933.869258303838;1073.1522097542854;1085.0939465546198;13572.1856688599;13793.379297931617;13908.165510069428;13955.79066314006;14154.221517816413;266539;270659;272435;272592;272978;46438;46606.06787864291;46768.5323146771;46941.765291173324;46998.530014700096;1162.575659884153;1187.6021532786613;1196.9281843089616;1199.1785626845638;1200.0519589524354;25313.367165821;25964.740352596233;25973.480530389665;26616.7338326622;26692.46615067649;41067.58932410757;41074.58925410708;41437.79281103575;41529.37705934353;41581.79209104056;254918;255840;257450;258969;258996;30047.3990520184;30270.697293026788;30446.391072178874;30554.236144096576;30603.2349191272;39584.802075989435;40179.59820401875;40276;41111.38332925068;41329.1734165321;30036.24909377283;31119.688803112585;31904.84047579747;32355.514667279538;32704.182395440304;33764;33766.66233337635;37267.81366093152;40875.59124408837;41733.791331043154;33590.16024599405;33676.66323336833;33925;34148.487772682936;34173.82913085419;36441.80919194221;36611;36847.44728829123;36994.44508332323;37698;26215;26726.465470690087;26763.33091672724;26839.463210736067;27019.72980270172 18:33:56 INFO - 2015-11-17 18:33:56,605 DEBUG : BROWSER_OUTPUT: |2;jquery.html;327.9704826565609;328.13863608028925;329.5748484455053;331.4795770640096;332.68893584498494;10618.46907654618;10937.45312734364;15143.545693629181;15581.766273505893;15850.841491585095;8449.746507604781;8665.350098742603;10398.11616012638;10621.946890265537;10626.840597391027;4081.4081958116053;4217.34631132175;4239.08859595187;4240.109576988836;4242.80907359168;3579.838907249167;4171.520275168364;4215.473065866767;4223.387608796723;4228.344606585984;4184.748915065105;4188.204241194178;4218.915621687564;4225.7887105644595;4226.281532139528;4203.91592168158;4204.138151678899;4216.683748718843;4219.367094935769;4225.809838557272;3681.889543313705;3722.9627703722886;3776.1126135358168;3783.432485127253;3788.886333410002;11535.711607209887;11578.247413918152;11579.594714185047;11795.29228246308;11931.701707457296;1637.7052130616485;1644.3340447118935;1664.2926756128718;1684.688332658462;1734.9913250433792;8798.318614554366;8803.823923521493;9057.637694492212;9117.589708463134;9122.452652840851;1496;1553.355357526625;1581.5097319830775;1609.99375390381;1663.866890648745;52295.47704522944;54562.45437545613;54768.45231547673;54790.45209547893;55269.723651381886;6221.502279817604;6274.247090349096;6282.623042617458;6356;6400.679966001681;7124.073870396815;7214;7280.635968201569;7295.234000429985;7330.816729581697;4371.868843934687;4460.487043989982;4495.325701144854;4526.185286648435;4598.609118224988;4531.093781243764;4533.977330113328;4546.363509108727;4551.294549344857;4593.127305811952;2893.6382952130984;2894.0738963531467;2934.1344303430537;2950.51316532774;2960.18594886408;1053.2785042246087;1061.883192848786;1062;1074.59165517103;1109.3399427340719;355.43663293679293;364.28236374342504;365.57410616631324;394.44186476135945;422.70891766624965;9055.094490551024;9110.316726245557;9155.679551215675;9159.725208243763;9306.90693093074;414.84028648970366;421.7511668115765;434.85215026890376;451.19236566545516;463.7403054289609;5456.208849716848;5499.422560631157;5508.118701007819;5516.117421212587;5535.059039963216;348936;421205;428086;431868;433597;35713.821430892676;68682.08456361732;69085.65457172682;69596.6520167396;70900.64549677321;476.1191795178891;482.53194401431256;486.04734719949295;486.21719032357873;489.3784893185634;9890.159336456481;9967.900320996698;9982.550785214538;10001.949990250003;10018.59925602997;30117.69882301149;31752.36495270128;33204;33345.66654333426;34918;38729.22541549097;39099.804500978455;39262;42424.78787606042;44708;6018.729157188025;6034.034554471264;6061.696915154313;6117.908231376622;6122.969385153046;10710.089642380484;10896.50965706561;11019.779604408028;11110.888891111308;11116.388598626829;9142.634294628406;9164.221041211571;9607.039296070338;9818.116369526777;9928.156106731009;9071.818563628822;9093.636254549743;9181.954090229507;9258.259339252709;9263.212626926786;9285.953570232376;9376.437413755197;9381.765455863659;9691.9030809691;10012.949935250277;5798.275215598051;5813.738381772915;5828.125781132694;5844.824655260349;5851.736671849691;9537.237021038161;9549.713508594754;9637.37357071788;9673.854892176763;9778.364406313567 18:33:56 INFO - 2015-11-17 18:33:56,608 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1358.2393859438712;1420.4176287722032;1515.651400177959;1575.7793908852755;1675.0619652994324;7043.577385356876;7186.425085993121;7228.746993855216;7243.348098671118;7380.5940673263085;7334.449916256275;7363.779086627396;7422.665980030898;7428.739994100208;7481.9251807481905;2056.681214411765;2082.9479263018393;2091.0903756865737;2095.4551816527737;2095.947601309972;2074.875507469557;2083.9791602083938;2086.8330533557278;2121.590745045727;2126.107035045277;2005.2079428625684;2018.6366454038268;2030.4822270321122;2092.95814083719;2096.916123355064;2017.1124705129696;2071.87568745875;2073.056759174587;2093.706881036656;2093.9844175574835;2094.9057292421876;2125.5855108253895;2146.195176808697;2149.795769401904;2163.0266380128846;7148.571085734872;7217.314355136306;7241.493095483318;7256.129264488242;7264.709411623581;4127.938080928789;4203.991042149893;4216.2621541230465;4218.641415479688;4219.261629214906;2825.0536070416433;2852.7717782577342;2882.8414437205947;2904.997775767357;2909.0690978886764;870.5429649434035;898.9820203595891;908.8091500784843;1743.450812993903;1743.834335738103;9689.51552422376;9749.122578967856;9794.853077203848;9811.509424528816;9819.558119884623;3739.9252014960093;3759.6616304532176;3795.8291876865605;3826.311263972456;3910.354791459434;7914.802129946797;7915;7917.208279172037;7928.048634163822;7938.841223175504;4166.187593419254;4168.478940132483;4184.916301673949;4194.874153775391;4200.264953633163;3753.9624603753614;3777.490038844721;3779.4519794629623;3783.6594706476;3790.3556395412847;3184.4268031754505;3193.9361212775616;3210.7431405487505;3224.2423030587793;3227.0480208338595;952.9332946693803;960.8126415349079;960.841461158901;966.6326795817545;971.1162841813915;664.1200409457392;730.5251586468731;830.5265998380986;862.3360012790116;945.1540870920487;6251.593646412968;6252.155958945576;6270.6864656766975;6296.464800491918;6296.874062518816;569.9259096317452;574.319431473705;593.5696619950502;597.1908064572528;714.9463790215755;4892.535209155125;4912.140375434356;4963.776630051656;4996.07572599063;5027.296178535008;8193;8320.459170154041;8498.362622803192;8530.957345213359;8653.567321633893;8577.485350878967;8581.570921454027;8594.269487093667;8647.956760216159;8654.437461564978;6570.211574611173;6618.63597502142;6628.403443690091;6635.834104147435;6653.73385064592;6312.400321969406;6378.043293506012;6392.584482008655;6421.261554921057;6427.614343139427;7334.889976650461;7568.091828980558;7576.3938884887975;7612.467127301035;7648.847023059619;7698.538087714755;7745.7676269712;7920.326772224425;7924.167962364099;7979.082405523439;5925.407459254213;6160.383961603804;6233.470155036873;6237.563370564017;6249.625022498482;6773.051772751917;6836.692348844414;6839.760608378683;6865.073215115895;6885.036094946611;6257.68711564429;6288.151099601495;6367.7183501548825;6411.839704007437;6636.535442518977;5678.68767217807;6349.0476428536085;6403.29563747978;6449.838754031187;6475.7733479328;6281.59169653971;6292.244930608356;6332.746690132343;6343.3022367538615;6351.618902865843;5734.2258795062135;5815.302163740378;5898.941010590011;5900.203472531325;5920.851978700394;6050.45545900871;6074.1799857020505;6100.23747031621;6101.969490152521;6107.328193898578 18:33:56 INFO - 2015-11-17 18:33:56,609 DEBUG : BROWSER_OUTPUT: |4;prototype.html;283.6341119955257;291.1730684855011;293.6549554273728;294.7332663939136;295.0455277178329;5554;5643.746031428585;5669.291338582677;5711;5730.627509211909;5561.332640083186;5596.832095037145;5615.971920140393;5629.943700563003;5639.774409023645;4334.198173337927;4335.1329734053315;4335.458067741532;4344.956550434486;4344.956550434486;4320.762358070305;4342.978285108586;4348.804303806336;4349.673774466912;4361.302191649337;4162.229987452331;4296.742195468266;4299.763513006784;4304.526502084768;4304.655627549789;4289.313709806432;4291.206126866539;4299.5485474025245;4301.1397720455725;4301.2902871026245;3751.3247615429214;3751.606081361472;3760.5863355030924;3762.5108735864437;3769.2838360711653;5419.512243898029;5433.266509021271;5436.374816896028;5438.646487978308;5445.782168713246;4581.358609794632;4820.517948205186;5012.248162775612;5012.749362531858;5016.147254966664;5815.389384114649;5816;5982.641041537521;5990.460858522711;6026.96986515069;4123;4125.814338354781;4128.236276288896;4138.275801734684;4143.274926887812;6108.694565271719;6208.906866397007;6295.527835412317;6296;6309.116723658645;4071.307877660805;4083.816228269735;4092.0383709828166;4093.2222877653153;4099.036726369301;4125.731827431207;4142.1922725068325;4143.7720925349395;4144.564820693844;4155.625993660585;4820.734859582757;4836.298736683161;4850.369451971292;4852.975735121302;4857.0043141155975;5829.067349224104;5939.406059394026;5958.225430693982;5978.372270911492;5981.431763982415;1478.22393243548;1507.0279669613037;1507.8492150785053;1513.054341036852;1514.1823415355584;1013.3615822032073;1014.6347314966606;1020.5305559442739;1036.1192985962023;1036.5750042482546;5112.105381558213;5122.078025955289;5128.538431541179;5130.820421285237;5134.743262836843;6109.633421994695;6110.572259941761;6129.264488261437;6131.202943617302;6136.662483563447;5133.743312834344;5138.691678499227;5142.434332223453;5147.6911385317;5156.639035267495;3262.029718310511;3286.3263031078573;3318.286568387808;3346.3140056288403;3353.564036675217;5791.536677065825;5822.214001109881;5823.155642431909;5824.388439213906;5840.649561026352;6332.176817013758;6351.777687780906;6356.45970092538;6366.331535188831;6374.266959299647;5687.51656109227;5779.88440231193;5791.82624521265;5826.184334193216;5827.999999999915;6117.816465506042;6152;6153.600015998945;6163.599366041193;6165.784197553244;5968.283805943314;6003.099535069599;6009.188759517584;6009.87980240384;6015.819525414245;5740.282464691913;5764.7405866736935;5792.333881603669;5801.274840644919;5801.477866991822;4007.559168491522;4127.938080928729;4141.130362623762;4151.169766046743;4153.709240353146;6011.338752737108;6168.845778855564;6172.69136543162;6176.505879529716;6242.375762423903;5994.07091900756;6007.279126504673;6014.218151640259;6017.488513476404;6027.427394397525;6002.459778619946;6003.129546215861;6003.759849605967;6005.3694362091355;6009.2188015557695;5697.886042279214;5837.1244313351635;5849;5866.530677545701;5887.116932460165;6017.699115044143;6022.45797878193;6057.757689692363;6070.3929607038945;6077;5878.941210587839;5904.793332233351;5906.232189815297;5907.70461476933;5910.497607703393 18:33:56 INFO - 2015-11-17 18:33:56,611 DEBUG : BROWSER_OUTPUT: |5;yui.html;547.3049227481101;588.1648059755147;590.0765302301897;592.2360155399534;594.1444320178942;10577.418241996687;10705.197110216726;10796.028357447838;10806.405647689393;10861.782764344729;9659.855102173473;9698.17565506931;11964.760704785898;12136.271823690584;12180.939095304511;738.3096804487794;749.2395218852841;750.7184805697864;767.8310771630232;768.0514564512822;747.4730315127849;754.1327473405601;756.0700338583518;761.3034073822446;763.480833033537;778.7157687444098;781.7771934998526;790.2097902097902;790.2334735306744;791.6239786101613;777.8599852026633;780.0171783552707;780.6721177105572;781.9061712594497;783.2206954080726;571.342955601058;576.6453631016936;576.7635269539511;579.7072478398424;580.819945816794;11037.83443248352;11039.613613523568;11115.221934464591;11118.61084862026;11122.221444498888;8738.30093592511;8739.082396348356;8915.687950921687;9136.08639136081;9534.570944307523;8669.436486628349;8800.075992020873;8875.245604123656;9003.27973762104;9011.143941325563;2727.1682136948225;2767.3635063935208;2778.3880954758733;2859.05651135127;2864.6562412510425;39461.802690986646;40110;40211.195776084605;40248.19503609911;40326.59673403258;6545.672716364258;6623.039659249382;6636.601803891782;6753;6784.559003664746;10420.583176673;10424.947875260576;10466.581336746445;10646.36121832677;10737.355758654505;5711.571632127607;5892.941070589325;5921.851953701106;5954.315253745788;5966.761329546856;3404.676555727202;3562.495036925268;3568.0544655666267;3584.301061293075;3615.313090512794;2305.216226483004;2319.315801838428;2330.97669023311;2341.9180328688412;2341.988290058539;381.35509494358973;383.70838162996324;386.9090763670535;390.8983664247259;392.131428885021;449.3080655790047;459.54734586432335;463.5827755020441;484.4186975629259;512.6001718659452;6337.144485494491;6399.744010239631;6536.444402225769;6830.043793868862;6869.107016087876;441.45480331790213;489.97839504632526;516.633190434788;548.8929658716512;549.4532939724919;3027.818330900153;3194.07371862162;3247.0745837436216;3649.2154186849953;3679.392900171495;50872.49127508677;55994.720026399606;56119;56355.43644563584;56416.43583564194;42942.570574294485;43473.78263108728;47660.52339476561;47743.76128119337;48046.27930581044;38061.61938380636;38313.42529862055;38357.61642383596;38564.61435385666;38603.22793544114;7176.892346614909;7255.854882902418;7675.961620191863;7831.608419579112;7986.081600616004;30799.846000769852;31363.686363136076;31483.212919676276;34132.82933585316;34274.31451370909;36892.26215475729;38561.42157867578;38632.80683596564;40290.798546007085;43859;6640.966795165993;6994.160700715946;7072.25741297177;7170.641467926478;7297.201910793266;10930.890691093306;10939.507722152362;11165.330080195214;11231.943840281074;11329.943350283196;9351.298652601217;9452;9590.040995900634;9966.651167209113;9974.15219706304;10401.58393664245;10479.266451348332;10552.20858435605;10686.305390149615;10871.836922446011;10189.949050254701;10254.333468324536;10274.33216840903;10431.791364172826;10627.521761520595;8779.20987111163;8997.753791718982;9070.274378049871;9321.347505674537;9356.391834530734;8683.348748843988;8733.694320698745;8745.431546949429;8791.692290769792;8862.42394244372 18:33:56 INFO - 2015-11-17 18:33:56,611 DEBUG : BROWSER_OUTPUT: __end_tp_report 18:33:56 INFO - 2015-11-17 18:33:56,611 DEBUG : BROWSER_OUTPUT: __start_cc_report 18:33:56 INFO - 2015-11-17 18:33:56,612 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,296 18:33:56 INFO - 2015-11-17 18:33:56,612 DEBUG : BROWSER_OUTPUT: __end_cc_report 18:33:56 INFO - 2015-11-17 18:33:56,612 DEBUG : BROWSER_OUTPUT: __startTimestamp1447814036599__endTimestamp 18:33:56 INFO - 2015-11-17 18:33:56,612 DEBUG : BROWSER_OUTPUT: 18:33:56 INFO - 2015-11-17 18:33:56,613 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 18:33:56 INFO - 2015-11-17 18:33:56,613 DEBUG : BROWSER_OUTPUT: Number of tests: 6 18:33:56 INFO - 2015-11-17 18:33:56,613 DEBUG : BROWSER_OUTPUT: 18:33:56 INFO - 2015-11-17 18:33:56,613 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4764.75 Median:4905.75 stddev:528.62 (10.8%) stddev-sans-first:505.14 18:33:56 INFO - 2015-11-17 18:33:56,614 DEBUG : BROWSER_OUTPUT: Values: 2712.8 2761.9 2790.0 2797.1 2818.7 4636.2 4831.0 4843.5 4869.6 4905.8 4669.8 4744.4 4752.3 4782.4 4852.9 4434.2 4492.3 4519.8 4553.6 4592.0 4565.7 4588.1 4617.0 4633.6 4678.4 4259.2 4294.8 4426.0 4426.9 4451.9 4451.3 4484.7 4513.8 4515.0 4533.7 4240.8 4489.0 4493.1 4496.5 4512.7 4623.2 4664.2 4726.9 4761.7 4771.8 5216.8 5229.6 5239.6 5242.8 5287.3 4965.5 5087.7 5262.7 5263.0 5270.9 4691.6 4756.0 4779.2 4808.7 4832.7 5367.5 5380.6 5384.6 5412.6 5417.2 4876.9 4997.4 5147.7 5166.2 5200.1 5116.4 5120.3 5125.7 5135.3 5166.5 5050.5 5063.5 5068.4 5073.3 5074.8 4859.2 4914.9 4995.2 5032.9 5065.4 3960.6 3981.1 3990.6 3998.3 4030.0 3549.6 3565.1 3579.1 3598.5 3603.7 4267.4 4366.9 4400.0 4482.7 4509.1 5218.4 5284.9 5296.1 5297.7 5306.2 4325.5 4524.7 4525.9 4532.3 4587.2 4504.4 4536.0 4609.4 4615.5 4659.5 4928.8 5003.8 5030.6 5031.6 5066.5 4912.4 5091.1 5310.6 5330.5 5377.9 4787.5 4850.8 4882.4 4915.3 4939.7 5140.4 5157.0 5158.6 5173.5 5200.0 4940.6 5059.4 5243.9 5245.8 5267.2 4992.7 5080.9 5104.8 5109.1 5138.1 5070.5 5076.3 5084.4 5089.7 5094.3 4678.8 4764.8 4846.2 4984.4 4998.9 5094.9 5118.9 5119.1 5128.0 5136.6 4982.6 4997.5 5002.9 5004.2 5004.9 18:33:56 INFO - 2015-11-17 18:33:56,614 DEBUG : BROWSER_OUTPUT: 18:33:56 INFO - 2015-11-17 18:33:56,615 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:41713.25 Median:37102.35 stddev:66031.71 (178.0%) stddev-sans-first:66144.57 18:33:56 INFO - 2015-11-17 18:33:56,615 DEBUG : BROWSER_OUTPUT: Values: 537.0 542.7 548.4 582.6 588.7 36272.3 37041.8 37074.3 37130.4 37138.6 40205.4 40651.0 40793.8 40821.8 40828.4 7891.4 8036.6 8048.1 8079.4 8093.2 7882.1 7995.7 8009.0 8011.2 8030.8 7946.2 8031.4 8051.9 8061.8 8075.8 7765.4 7771.1 7816.9 7849.0 7855.9 7804.3 7938.3 7959.8 8034.6 8052.7 38591.8 38963.0 38999.0 39080.2 39192.0 2751.2 2753.2 2791.0 2846.3 2846.4 28827.6 29255.7 29338.4 29404.7 29434.0 2937.5 2962.2 2992.7 3154.1 3162.8 229991.0 230054.0 230416.0 231606.0 231746.0 41912.2 42415.0 55182.7 56692.4 56920.0 55933.6 55952.4 56165.2 56196.6 56359.0 12513.2 12620.8 12654.5 12688.9 12691.5 9106.6 9129.3 9156.3 9162.5 9315.4 18523.4 18778.0 18932.8 18974.3 19035.9 7603.6 7817.7 7844.6 7915.7 7935.9 783.6 857.1 869.8 897.3 984.1 26423.6 26712.6 26762.0 26879.2 26920.7 893.6 918.8 933.9 1073.2 1085.1 13572.2 13793.4 13908.2 13955.8 14154.2 266539.0 270659.0 272435.0 272592.0 272978.0 46438.0 46606.1 46768.5 46941.8 46998.5 1162.6 1187.6 1196.9 1199.2 1200.1 25313.4 25964.7 25973.5 26616.7 26692.5 41067.6 41074.6 41437.8 41529.4 41581.8 254918.0 255840.0 257450.0 258969.0 258996.0 30047.4 30270.7 30446.4 30554.2 30603.2 39584.8 40179.6 40276.0 41111.4 41329.2 30036.2 31119.7 31904.8 32355.5 32704.2 33764.0 33766.7 37267.8 40875.6 41733.8 33590.2 33676.7 33925.0 34148.5 34173.8 36441.8 36611.0 36847.4 36994.4 37698.0 26215.0 26726.5 26763.3 26839.5 27019.7 18:33:56 INFO - 2015-11-17 18:33:56,615 DEBUG : BROWSER_OUTPUT: 18:33:56 INFO - 2015-11-17 18:33:56,615 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:21798.97 Median:429977.00 stddev:68014.04 (15.8%) stddev-sans-first:68185.73 18:33:56 INFO - 2015-11-17 18:33:56,616 DEBUG : BROWSER_OUTPUT: Values: 328.0 328.1 329.6 331.5 332.7 10618.5 10937.5 15143.5 15581.8 15850.8 8449.7 8665.4 10398.1 10621.9 10626.8 4081.4 4217.3 4239.1 4240.1 4242.8 3579.8 4171.5 4215.5 4223.4 4228.3 4184.7 4188.2 4218.9 4225.8 4226.3 4203.9 4204.1 4216.7 4219.4 4225.8 3681.9 3723.0 3776.1 3783.4 3788.9 11535.7 11578.2 11579.6 11795.3 11931.7 1637.7 1644.3 1664.3 1684.7 1735.0 8798.3 8803.8 9057.6 9117.6 9122.5 1496.0 1553.4 1581.5 1610.0 1663.9 52295.5 54562.5 54768.5 54790.5 55269.7 6221.5 6274.2 6282.6 6356.0 6400.7 7124.1 7214.0 7280.6 7295.2 7330.8 4371.9 4460.5 4495.3 4526.2 4598.6 4531.1 4534.0 4546.4 4551.3 4593.1 2893.6 2894.1 2934.1 2950.5 2960.2 1053.3 1061.9 1062.0 1074.6 1109.3 355.4 364.3 365.6 394.4 422.7 9055.1 9110.3 9155.7 9159.7 9306.9 414.8 421.8 434.9 451.2 463.7 5456.2 5499.4 5508.1 5516.1 5535.1 348936.0 421205.0 428086.0 431868.0 433597.0 35713.8 68682.1 69085.7 69596.7 70900.6 476.1 482.5 486.0 486.2 489.4 9890.2 9967.9 9982.6 10001.9 10018.6 30117.7 31752.4 33204.0 33345.7 34918.0 38729.2 39099.8 39262.0 42424.8 44708.0 6018.7 6034.0 6061.7 6117.9 6123.0 10710.1 10896.5 11019.8 11110.9 11116.4 9142.6 9164.2 9607.0 9818.1 9928.2 9071.8 9093.6 9182.0 9258.3 9263.2 9286.0 9376.4 9381.8 9691.9 10012.9 5798.3 5813.7 5828.1 5844.8 5851.7 9537.2 9549.7 9637.4 9673.9 9778.4 18:33:56 INFO - 2015-11-17 18:33:56,616 DEBUG : BROWSER_OUTPUT: 18:33:56 INFO - 2015-11-17 18:33:56,616 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4937.99 Median:6276.14 stddev:2582.65 (41.2%) stddev-sans-first:2575.88 18:33:56 INFO - 2015-11-17 18:33:56,617 DEBUG : BROWSER_OUTPUT: Values: 1358.2 1420.4 1515.7 1575.8 1675.1 7043.6 7186.4 7228.7 7243.3 7380.6 7334.4 7363.8 7422.7 7428.7 7481.9 2056.7 2082.9 2091.1 2095.5 2095.9 2074.9 2084.0 2086.8 2121.6 2126.1 2005.2 2018.6 2030.5 2093.0 2096.9 2017.1 2071.9 2073.1 2093.7 2094.0 2094.9 2125.6 2146.2 2149.8 2163.0 7148.6 7217.3 7241.5 7256.1 7264.7 4127.9 4204.0 4216.3 4218.6 4219.3 2825.1 2852.8 2882.8 2905.0 2909.1 870.5 899.0 908.8 1743.5 1743.8 9689.5 9749.1 9794.9 9811.5 9819.6 3739.9 3759.7 3795.8 3826.3 3910.4 7914.8 7915.0 7917.2 7928.0 7938.8 4166.2 4168.5 4184.9 4194.9 4200.3 3754.0 3777.5 3779.5 3783.7 3790.4 3184.4 3193.9 3210.7 3224.2 3227.0 952.9 960.8 960.8 966.6 971.1 664.1 730.5 830.5 862.3 945.2 6251.6 6252.2 6270.7 6296.5 6296.9 569.9 574.3 593.6 597.2 714.9 4892.5 4912.1 4963.8 4996.1 5027.3 8193.0 8320.5 8498.4 8531.0 8653.6 8577.5 8581.6 8594.3 8648.0 8654.4 6570.2 6618.6 6628.4 6635.8 6653.7 6312.4 6378.0 6392.6 6421.3 6427.6 7334.9 7568.1 7576.4 7612.5 7648.8 7698.5 7745.8 7920.3 7924.2 7979.1 5925.4 6160.4 6233.5 6237.6 6249.6 6773.1 6836.7 6839.8 6865.1 6885.0 6257.7 6288.2 6367.7 6411.8 6636.5 5678.7 6349.0 6403.3 6449.8 6475.8 6281.6 6292.2 6332.7 6343.3 6351.6 5734.2 5815.3 5898.9 5900.2 5920.9 6050.5 6074.2 6100.2 6102.0 6107.3 18:33:56 INFO - 2015-11-17 18:33:56,617 DEBUG : BROWSER_OUTPUT: 18:33:56 INFO - 2015-11-17 18:33:56,618 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4900.07 Median:5557.67 stddev:1465.90 (26.4%) stddev-sans-first:1428.47 18:33:56 INFO - 2015-11-17 18:33:56,618 DEBUG : BROWSER_OUTPUT: Values: 283.6 291.2 293.7 294.7 295.0 5554.0 5643.7 5669.3 5711.0 5730.6 5561.3 5596.8 5616.0 5629.9 5639.8 4334.2 4335.1 4335.5 4345.0 4345.0 4320.8 4343.0 4348.8 4349.7 4361.3 4162.2 4296.7 4299.8 4304.5 4304.7 4289.3 4291.2 4299.5 4301.1 4301.3 3751.3 3751.6 3760.6 3762.5 3769.3 5419.5 5433.3 5436.4 5438.6 5445.8 4581.4 4820.5 5012.2 5012.7 5016.1 5815.4 5816.0 5982.6 5990.5 6027.0 4123.0 4125.8 4128.2 4138.3 4143.3 6108.7 6208.9 6295.5 6296.0 6309.1 4071.3 4083.8 4092.0 4093.2 4099.0 4125.7 4142.2 4143.8 4144.6 4155.6 4820.7 4836.3 4850.4 4853.0 4857.0 5829.1 5939.4 5958.2 5978.4 5981.4 1478.2 1507.0 1507.8 1513.1 1514.2 1013.4 1014.6 1020.5 1036.1 1036.6 5112.1 5122.1 5128.5 5130.8 5134.7 6109.6 6110.6 6129.3 6131.2 6136.7 5133.7 5138.7 5142.4 5147.7 5156.6 3262.0 3286.3 3318.3 3346.3 3353.6 5791.5 5822.2 5823.2 5824.4 5840.6 6332.2 6351.8 6356.5 6366.3 6374.3 5687.5 5779.9 5791.8 5826.2 5828.0 6117.8 6152.0 6153.6 6163.6 6165.8 5968.3 6003.1 6009.2 6009.9 6015.8 5740.3 5764.7 5792.3 5801.3 5801.5 4007.6 4127.9 4141.1 4151.2 4153.7 6011.3 6168.8 6172.7 6176.5 6242.4 5994.1 6007.3 6014.2 6017.5 6027.4 6002.5 6003.1 6003.8 6005.4 6009.2 5697.9 5837.1 5849.0 5866.5 5887.1 6017.7 6022.5 6057.8 6070.4 6077.0 5878.9 5904.8 5906.2 5907.7 5910.5 18:33:56 INFO - 2015-11-17 18:33:56,618 DEBUG : BROWSER_OUTPUT: 18:33:56 INFO - 2015-11-17 18:33:56,619 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11779.05 Median:514.62 stddev:14359.07 (2790.2%) stddev-sans-first:14374.58 18:33:56 INFO - 2015-11-17 18:33:56,619 DEBUG : BROWSER_OUTPUT: Values: 547.3 588.2 590.1 592.2 594.1 10577.4 10705.2 10796.0 10806.4 10861.8 9659.9 9698.2 11964.8 12136.3 12180.9 738.3 749.2 750.7 767.8 768.1 747.5 754.1 756.1 761.3 763.5 778.7 781.8 790.2 790.2 791.6 777.9 780.0 780.7 781.9 783.2 571.3 576.6 576.8 579.7 580.8 11037.8 11039.6 11115.2 11118.6 11122.2 8738.3 8739.1 8915.7 9136.1 9534.6 8669.4 8800.1 8875.2 9003.3 9011.1 2727.2 2767.4 2778.4 2859.1 2864.7 39461.8 40110.0 40211.2 40248.2 40326.6 6545.7 6623.0 6636.6 6753.0 6784.6 10420.6 10424.9 10466.6 10646.4 10737.4 5711.6 5892.9 5921.9 5954.3 5966.8 3404.7 3562.5 3568.1 3584.3 3615.3 2305.2 2319.3 2331.0 2341.9 2342.0 381.4 383.7 386.9 390.9 392.1 449.3 459.5 463.6 484.4 512.6 6337.1 6399.7 6536.4 6830.0 6869.1 441.5 490.0 516.6 548.9 549.5 3027.8 3194.1 3247.1 3649.2 3679.4 50872.5 55994.7 56119.0 56355.4 56416.4 42942.6 43473.8 47660.5 47743.8 48046.3 38061.6 38313.4 38357.6 38564.6 38603.2 7176.9 7255.9 7676.0 7831.6 7986.1 30799.8 31363.7 31483.2 34132.8 34274.3 36892.3 38561.4 38632.8 40290.8 43859.0 6641.0 6994.2 7072.3 7170.6 7297.2 10930.9 10939.5 11165.3 11231.9 11329.9 9351.3 9452.0 9590.0 9966.7 9974.2 10401.6 10479.3 10552.2 10686.3 10871.8 10189.9 10254.3 10274.3 10431.8 10627.5 8779.2 8997.8 9070.3 9321.3 9356.4 8683.3 8733.7 8745.4 8791.7 8862.4 18:33:56 INFO - 2015-11-17 18:33:56,619 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 18:33:56 INFO - 2015-11-17 18:33:56,619 DEBUG : BROWSER_OUTPUT: 18:33:57 INFO - 2015-11-17 18:33:57,365 INFO : Browser exited with error code: 0 18:33:57 INFO - 2015-11-17 18:33:57,386 INFO : Completed test dromaeo_css (00:18:36) 18:33:57 INFO - 2015-11-17 18:33:57,386 INFO : Starting test kraken 18:33:57 INFO - 2015-11-17 18:33:57,386 DEBUG : operating with platform_type : linux_ 18:33:57 INFO - 2015-11-17 18:33:57,387 INFO : Initialising browser for kraken test... 18:33:57 INFO - 2015-11-17 18:33:57,393 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4em5l4/profile http://localhost:51143/getInfo.html 18:34:02 INFO - 2015-11-17 18:34:02,152 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 18:34:02 INFO - 2015-11-17 18:34:02,152 DEBUG : BROWSER_OUTPUT: colorDepth:24 18:34:02 INFO - 2015-11-17 18:34:02,152 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 18:34:02 INFO - 2015-11-17 18:34:02,152 DEBUG : BROWSER_OUTPUT: __metrics 18:34:03 INFO - 2015-11-17 18:34:03,269 INFO : Browser initialized. 18:34:03 INFO - 2015-11-17 18:34:03,270 INFO : Running cycle 1/1 for kraken test... 18:34:03 INFO - 2015-11-17 18:34:03,270 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4em5l4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 18:34:15 INFO - 2015-11-17 18:34:15,174 DEBUG : BROWSER_OUTPUT: RSS: Main: 141152256 18:34:15 INFO - 2015-11-17 18:34:15,175 DEBUG : BROWSER_OUTPUT: 18:34:17 INFO - 2015-11-17 18:34:17,771 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:51143/tests/kraken/driver.html?testName=audio-beat-detection) 18:34:18 INFO - 2015-11-17 18:34:18,379 DEBUG : BROWSER_OUTPUT: RSS: Main: 141062144 18:34:18 INFO - 2015-11-17 18:34:18,379 DEBUG : BROWSER_OUTPUT: 18:34:21 INFO - 2015-11-17 18:34:21,149 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:51143/tests/kraken/driver.html?testName=audio-dft) 18:34:21 INFO - 2015-11-17 18:34:21,743 DEBUG : BROWSER_OUTPUT: RSS: Main: 141783040 18:34:21 INFO - 2015-11-17 18:34:21,743 DEBUG : BROWSER_OUTPUT: 18:34:24 INFO - 2015-11-17 18:34:24,684 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:51143/tests/kraken/driver.html?testName=audio-fft) 18:34:25 INFO - 2015-11-17 18:34:25,285 DEBUG : BROWSER_OUTPUT: RSS: Main: 136658944 18:34:25 INFO - 2015-11-17 18:34:25,285 DEBUG : BROWSER_OUTPUT: 18:34:27 INFO - 2015-11-17 18:34:27,343 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:51143/tests/kraken/driver.html?testName=audio-oscillator) 18:34:27 INFO - 2015-11-17 18:34:27,929 DEBUG : BROWSER_OUTPUT: RSS: Main: 136454144 18:34:27 INFO - 2015-11-17 18:34:27,929 DEBUG : BROWSER_OUTPUT: 18:34:30 INFO - 2015-11-17 18:34:30,130 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:51143/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:34:30 INFO - 2015-11-17 18:34:30,716 DEBUG : BROWSER_OUTPUT: RSS: Main: 137822208 18:34:30 INFO - 2015-11-17 18:34:30,716 DEBUG : BROWSER_OUTPUT: 18:34:33 INFO - 2015-11-17 18:34:33,788 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:51143/tests/kraken/driver.html?testName=imaging-darkroom) 18:34:34 INFO - 2015-11-17 18:34:34,390 DEBUG : BROWSER_OUTPUT: RSS: Main: 138252288 18:34:34 INFO - 2015-11-17 18:34:34,390 DEBUG : BROWSER_OUTPUT: 18:34:37 INFO - 2015-11-17 18:34:37,852 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:51143/tests/kraken/driver.html?testName=imaging-desaturate) 18:34:38 INFO - 2015-11-17 18:34:38,458 DEBUG : BROWSER_OUTPUT: RSS: Main: 135974912 18:34:38 INFO - 2015-11-17 18:34:38,458 DEBUG : BROWSER_OUTPUT: 18:34:41 INFO - 2015-11-17 18:34:41,382 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:51143/tests/kraken/driver.html?testName=json-parse-financial) 18:34:41 INFO - 2015-11-17 18:34:41,972 DEBUG : BROWSER_OUTPUT: RSS: Main: 137129984 18:34:41 INFO - 2015-11-17 18:34:41,972 DEBUG : BROWSER_OUTPUT: 18:34:43 INFO - 2015-11-17 18:34:43,729 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:51143/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:34:44 INFO - 2015-11-17 18:34:44,319 DEBUG : BROWSER_OUTPUT: RSS: Main: 137977856 18:34:44 INFO - 2015-11-17 18:34:44,319 DEBUG : BROWSER_OUTPUT: 18:34:46 INFO - 2015-11-17 18:34:46,222 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:51143/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:34:46 INFO - 2015-11-17 18:34:46,843 DEBUG : BROWSER_OUTPUT: RSS: Main: 138805248 18:34:46 INFO - 2015-11-17 18:34:46,843 DEBUG : BROWSER_OUTPUT: 18:34:49 INFO - 2015-11-17 18:34:49,066 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:51143/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:34:49 INFO - 2015-11-17 18:34:49,653 DEBUG : BROWSER_OUTPUT: RSS: Main: 138272768 18:34:49 INFO - 2015-11-17 18:34:49,653 DEBUG : BROWSER_OUTPUT: 18:34:52 INFO - 2015-11-17 18:34:52,281 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:51143/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:34:52 INFO - 2015-11-17 18:34:52,888 DEBUG : BROWSER_OUTPUT: RSS: Main: 138915840 18:34:52 INFO - 2015-11-17 18:34:52,889 DEBUG : BROWSER_OUTPUT: 18:34:55 INFO - 2015-11-17 18:34:55,545 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:51143/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:34:56 INFO - 2015-11-17 18:34:56,131 DEBUG : BROWSER_OUTPUT: RSS: Main: 138194944 18:34:56 INFO - 2015-11-17 18:34:56,131 DEBUG : BROWSER_OUTPUT: 18:34:57 INFO - 2015-11-17 18:34:57,904 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:51143/tests/kraken/driver.html?testName=ai-astar) 18:34:58 INFO - 2015-11-17 18:34:58,155 DEBUG : BROWSER_OUTPUT: RSS: Main: 138260480 18:34:58 INFO - 2015-11-17 18:34:58,155 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,158 DEBUG : BROWSER_OUTPUT: __start_tp_report 18:34:58 INFO - 2015-11-17 18:34:58,158 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 18:34:58 INFO - 2015-11-17 18:34:58,159 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 18:34:58 INFO - 2015-11-17 18:34:58,159 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 18:34:58 INFO - 2015-11-17 18:34:58,159 DEBUG : BROWSER_OUTPUT: |0;ai-astar;115;106;111;113;112;126;112;113;112;111 18:34:58 INFO - 2015-11-17 18:34:58,159 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;168;148;163;162;131;153;161;140;168;133 18:34:58 INFO - 2015-11-17 18:34:58,159 DEBUG : BROWSER_OUTPUT: |2;audio-dft;163;163;164;162;163;168;174;162;165;163 18:34:58 INFO - 2015-11-17 18:34:58,160 DEBUG : BROWSER_OUTPUT: |3;audio-fft;73;72;74;73;73;136;73;73;74;73 18:34:58 INFO - 2015-11-17 18:34:58,160 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;91;90;125;91;91;92;128;91;92;127 18:34:58 INFO - 2015-11-17 18:34:58,160 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;111;110;110;110;110;110;118;110;110 18:34:58 INFO - 2015-11-17 18:34:58,160 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;150;149;149;150;149;149;148;150;149;151 18:34:58 INFO - 2015-11-17 18:34:58,160 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;97;98;96;96;96;100;101;95;97 18:34:58 INFO - 2015-11-17 18:34:58,160 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;73;73;73;74;74;72;76;73;72;72 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;70;70;69;69;69;70;72;69;69 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;86;82;83;83;86;84;84;86;82;99 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;128;139;124;126;144;124;138;131;127;120 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;136;155;147;149;147;154;161;153;148;146 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;73;70;72;73;76;72;71;69;73;72 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: __end_tp_report 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: __start_cc_report 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,785 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: __end_cc_report 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: __startTimestamp1447814098157__endTimestamp 18:34:58 INFO - 2015-11-17 18:34:58,161 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,165 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 18:34:58 INFO - 2015-11-17 18:34:58,165 DEBUG : BROWSER_OUTPUT: Number of tests: 14 18:34:58 INFO - 2015-11-17 18:34:58,165 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,165 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:113.10 Median:112.50 stddev:5.09 (4.5%) stddev-sans-first:5.35 18:34:58 INFO - 2015-11-17 18:34:58,165 DEBUG : BROWSER_OUTPUT: Values: 115.0 106.0 111.0 113.0 112.0 126.0 112.0 113.0 112.0 111.0 18:34:58 INFO - 2015-11-17 18:34:58,166 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,166 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:152.70 Median:161.50 stddev:14.03 (8.7%) stddev-sans-first:13.75 18:34:58 INFO - 2015-11-17 18:34:58,166 DEBUG : BROWSER_OUTPUT: Values: 168.0 148.0 163.0 162.0 131.0 153.0 161.0 140.0 168.0 133.0 18:34:58 INFO - 2015-11-17 18:34:58,166 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,166 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:164.70 Median:163.50 stddev:3.71 (2.3%) stddev-sans-first:3.89 18:34:58 INFO - 2015-11-17 18:34:58,166 DEBUG : BROWSER_OUTPUT: Values: 163.0 163.0 164.0 162.0 163.0 168.0 174.0 162.0 165.0 163.0 18:34:58 INFO - 2015-11-17 18:34:58,166 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,167 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:79.40 Median:73.00 stddev:19.90 (27.3%) stddev-sans-first:20.97 18:34:58 INFO - 2015-11-17 18:34:58,167 DEBUG : BROWSER_OUTPUT: Values: 73.0 72.0 74.0 73.0 73.0 136.0 73.0 73.0 74.0 73.0 18:34:58 INFO - 2015-11-17 18:34:58,167 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,167 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:101.80 Median:91.00 stddev:17.18 (18.9%) stddev-sans-first:17.78 18:34:58 INFO - 2015-11-17 18:34:58,167 DEBUG : BROWSER_OUTPUT: Values: 91.0 90.0 125.0 91.0 91.0 92.0 128.0 91.0 92.0 127.0 18:34:58 INFO - 2015-11-17 18:34:58,168 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,168 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:110.90 Median:110.00 stddev:2.51 (2.3%) stddev-sans-first:2.65 18:34:58 INFO - 2015-11-17 18:34:58,168 DEBUG : BROWSER_OUTPUT: Values: 110.0 111.0 110.0 110.0 110.0 110.0 110.0 118.0 110.0 110.0 18:34:58 INFO - 2015-11-17 18:34:58,168 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,168 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:149.40 Median:149.50 stddev:0.84 (0.6%) stddev-sans-first:0.87 18:34:58 INFO - 2015-11-17 18:34:58,168 DEBUG : BROWSER_OUTPUT: Values: 150.0 149.0 149.0 150.0 149.0 149.0 148.0 150.0 149.0 151.0 18:34:58 INFO - 2015-11-17 18:34:58,168 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,168 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:97.20 Median:96.00 stddev:1.93 (2.0%) stddev-sans-first:2.00 18:34:58 INFO - 2015-11-17 18:34:58,169 DEBUG : BROWSER_OUTPUT: Values: 96.0 97.0 98.0 96.0 96.0 96.0 100.0 101.0 95.0 97.0 18:34:58 INFO - 2015-11-17 18:34:58,169 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,169 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:73.20 Median:73.00 stddev:1.23 (1.7%) stddev-sans-first:1.30 18:34:58 INFO - 2015-11-17 18:34:58,169 DEBUG : BROWSER_OUTPUT: Values: 73.0 73.0 73.0 74.0 74.0 72.0 76.0 73.0 72.0 72.0 18:34:58 INFO - 2015-11-17 18:34:58,169 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,169 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:69.50 Median:69.50 stddev:1.08 (1.6%) stddev-sans-first:1.00 18:34:58 INFO - 2015-11-17 18:34:58,169 DEBUG : BROWSER_OUTPUT: Values: 68.0 70.0 70.0 69.0 69.0 69.0 70.0 72.0 69.0 69.0 18:34:58 INFO - 2015-11-17 18:34:58,170 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,170 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.50 Median:85.00 stddev:4.99 (5.9%) stddev-sans-first:5.29 18:34:58 INFO - 2015-11-17 18:34:58,170 DEBUG : BROWSER_OUTPUT: Values: 86.0 82.0 83.0 83.0 86.0 84.0 84.0 86.0 82.0 99.0 18:34:58 INFO - 2015-11-17 18:34:58,170 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,170 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:130.10 Median:129.50 stddev:7.77 (6.0%) stddev-sans-first:8.20 18:34:58 INFO - 2015-11-17 18:34:58,170 DEBUG : BROWSER_OUTPUT: Values: 128.0 139.0 124.0 126.0 144.0 124.0 138.0 131.0 127.0 120.0 18:34:58 INFO - 2015-11-17 18:34:58,170 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,171 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:149.60 Median:151.00 stddev:6.70 (4.4%) stddev-sans-first:4.99 18:34:58 INFO - 2015-11-17 18:34:58,171 DEBUG : BROWSER_OUTPUT: Values: 136.0 155.0 147.0 149.0 147.0 154.0 161.0 153.0 148.0 146.0 18:34:58 INFO - 2015-11-17 18:34:58,171 DEBUG : BROWSER_OUTPUT: 18:34:58 INFO - 2015-11-17 18:34:58,171 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.10 Median:72.50 stddev:1.91 (2.6%) stddev-sans-first:2.00 18:34:58 INFO - 2015-11-17 18:34:58,171 DEBUG : BROWSER_OUTPUT: Values: 73.0 70.0 72.0 73.0 76.0 72.0 71.0 69.0 73.0 72.0 18:34:58 INFO - 2015-11-17 18:34:58,171 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 18:34:58 INFO - 2015-11-17 18:34:58,171 DEBUG : BROWSER_OUTPUT: 18:34:59 INFO - 2015-11-17 18:34:59,085 INFO : Browser exited with error code: 0 18:34:59 INFO - 2015-11-17 18:34:59,138 INFO : Completed test kraken (00:01:01) 18:34:59 INFO - 2015-11-17 18:34:59,138 INFO : Starting test v8_7 18:34:59 INFO - 2015-11-17 18:34:59,138 DEBUG : operating with platform_type : linux_ 18:34:59 INFO - 2015-11-17 18:34:59,138 INFO : Initialising browser for v8_7 test... 18:34:59 INFO - 2015-11-17 18:34:59,144 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAyC4Zt/profile http://localhost:51143/getInfo.html 18:35:03 INFO - 2015-11-17 18:35:03,972 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 18:35:03 INFO - 2015-11-17 18:35:03,973 DEBUG : BROWSER_OUTPUT: colorDepth:24 18:35:03 INFO - 2015-11-17 18:35:03,973 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 18:35:03 INFO - 2015-11-17 18:35:03,973 DEBUG : BROWSER_OUTPUT: __metrics 18:35:05 INFO - 2015-11-17 18:35:05,081 INFO : Browser initialized. 18:35:05 INFO - 2015-11-17 18:35:05,082 INFO : Running cycle 1/1 for v8_7 test... 18:35:05 INFO - 2015-11-17 18:35:05,082 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpAyC4Zt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 18:35:17 INFO - 2015-11-17 18:35:17,021 DEBUG : BROWSER_OUTPUT: RSS: Main: 141144064 18:35:17 INFO - 2015-11-17 18:35:17,021 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,417 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:51143/tests/v8_7/run.html (next: http://localhost:51143/tests/v8_7/run.html) 18:35:38 INFO - 2015-11-17 18:35:38,667 DEBUG : BROWSER_OUTPUT: RSS: Main: 138625024 18:35:38 INFO - 2015-11-17 18:35:38,668 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,668 DEBUG : BROWSER_OUTPUT: __start_tp_report 18:35:38 INFO - 2015-11-17 18:35:38,668 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 18:35:38 INFO - 2015-11-17 18:35:38,668 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 18:35:38 INFO - 2015-11-17 18:35:38,668 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 18:35:38 INFO - 2015-11-17 18:35:38,668 DEBUG : BROWSER_OUTPUT: |0;Richards;165.7550140891762 18:35:38 INFO - 2015-11-17 18:35:38,668 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;190.83969465648855 18:35:38 INFO - 2015-11-17 18:35:38,668 DEBUG : BROWSER_OUTPUT: |2;Encrypt;283.28611898017 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5050.251256281407 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1054.8523206751054 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: |5;Earley;698.3240223463687 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: |6;Boyer;12444.444444444445 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: |7;RegExp;26205.128205128207 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: |8;Splay;632.6402016383113 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4840.579710144928 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: __end_tp_report 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: __startTimestamp1447814138667__endTimestamp 18:35:38 INFO - 2015-11-17 18:35:38,669 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: Number of tests: 10 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:165.76 Median:165.76 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: Values: 165.8 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:190.84 Median:190.84 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: Values: 190.8 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:283.29 Median:283.29 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,670 DEBUG : BROWSER_OUTPUT: Values: 283.3 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5050.25 Median:5050.25 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: Values: 5050.3 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1054.85 Median:1054.85 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: Values: 1054.9 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:698.32 Median:698.32 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: Values: 698.3 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12444.44 Median:12444.44 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,671 DEBUG : BROWSER_OUTPUT: Values: 12444.4 18:35:38 INFO - 2015-11-17 18:35:38,672 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,672 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:26205.13 Median:26205.13 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,672 DEBUG : BROWSER_OUTPUT: Values: 26205.1 18:35:38 INFO - 2015-11-17 18:35:38,672 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,672 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:632.64 Median:632.64 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,672 DEBUG : BROWSER_OUTPUT: Values: 632.6 18:35:38 INFO - 2015-11-17 18:35:38,672 DEBUG : BROWSER_OUTPUT: 18:35:38 INFO - 2015-11-17 18:35:38,672 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4840.58 Median:4840.58 stddev:0.00 (0.0%) 18:35:38 INFO - 2015-11-17 18:35:38,672 DEBUG : BROWSER_OUTPUT: Values: 4840.6 18:35:38 INFO - 2015-11-17 18:35:38,673 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 18:35:38 INFO - 2015-11-17 18:35:38,673 DEBUG : BROWSER_OUTPUT: 18:35:39 INFO - 2015-11-17 18:35:39,609 INFO : Browser exited with error code: 0 18:35:39 INFO - 2015-11-17 18:35:39,624 INFO : Completed test v8_7 (00:00:40) 18:35:39 INFO - 2015-11-17 18:35:39,721 INFO : Completed test suite (00:20:18) 18:35:39 INFO - 2015-11-17 18:35:39,722 DEBUG : Working with test: dromaeo_css 18:35:39 INFO - 2015-11-17 18:35:39,722 DEBUG : Generating results file: dromaeo_css 18:35:39 INFO - 2015-11-17 18:35:39,723 DEBUG : Working with test: kraken 18:35:39 INFO - 2015-11-17 18:35:39,723 DEBUG : Generating results file: kraken 18:35:39 INFO - 2015-11-17 18:35:39,723 INFO : javascript benchmark 18:35:39 INFO - 2015-11-17 18:35:39,723 DEBUG : Working with test: v8_7 18:35:39 INFO - 2015-11-17 18:35:39,724 DEBUG : Generating results file: v8_7 18:35:39 INFO - 2015-11-17 18:35:39,724 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:35:39 INFO - 2015-11-17 18:35:39,864 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,132,43]] 18:35:39 INFO - 2015-11-17 18:35:39,864 DEBUG : process_Request line: dromaeo_css 5951.81 graph.html#tests=[[72,132,43]] 18:35:39 INFO - 2015-11-17 18:35:39,864 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:35:39 INFO - 2015-11-17 18:35:39,966 DEBUG : process_Request line: kraken 1549.20 graph.html#tests=[[232,132,43]] 18:35:39 INFO - 2015-11-17 18:35:39,967 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:35:40 INFO - 2015-11-17 18:35:40,003 DEBUG : process_Request line: v8_7 21245.56 graph.html#tests=[[230,132,43]] 18:35:40 INFO - 2015-11-17 18:35:40,005 INFO : javascript benchmark 18:35:40 INFO - 2015-11-17 18:35:40,008 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [327.9704826565609, 328.13863608028925, 329.5748484455053, 331.4795770640096, 332.68893584498494, 10618.46907654618, 10937.45312734364, 15143.545693629181, 15581.766273505893, 15850.841491585095, 8449.746507604781, 8665.350098742603, 10398.11616012638, 10621.946890265537, 10626.840597391027, 4081.4081958116053, 4217.34631132175, 4239.08859595187, 4240.109576988836, 4242.80907359168, 3579.838907249167, 4171.520275168364, 4215.473065866767, 4223.387608796723, 4228.344606585984, 4184.748915065105, 4188.204241194178, 4218.915621687564, 4225.7887105644595, 4226.281532139528, 4203.91592168158, 4204.138151678899, 4216.683748718843, 4219.367094935769, 4225.809838557272, 3681.889543313705, 3722.9627703722886, 3776.1126135358168, 3783.432485127253, 3788.886333410002, 11535.711607209887, 11578.247413918152, 11579.594714185047, 11795.29228246308, 11931.701707457296, 1637.7052130616485, 1644.3340447118935, 1664.2926756128718, 1684.688332658462, 1734.9913250433792, 8798.318614554366, 8803.823923521493, 9057.637694492212, 9117.589708463134, 9122.452652840851, 1496.0, 1553.355357526625, 1581.5097319830775, 1609.99375390381, 1663.866890648745, 52295.47704522944, 54562.45437545613, 54768.45231547673, 54790.45209547893, 55269.723651381886, 6221.502279817604, 6274.247090349096, 6282.623042617458, 6356.0, 6400.679966001681, 7124.073870396815, 7214.0, 7280.635968201569, 7295.234000429985, 7330.816729581697, 4371.868843934687, 4460.487043989982, 4495.325701144854, 4526.185286648435, 4598.609118224988, 4531.093781243764, 4533.977330113328, 4546.363509108727, 4551.294549344857, 4593.127305811952, 2893.6382952130984, 2894.0738963531467, 2934.1344303430537, 2950.51316532774, 2960.18594886408, 1053.2785042246087, 1061.883192848786, 1062.0, 1074.59165517103, 1109.3399427340719, 355.43663293679293, 364.28236374342504, 365.57410616631324, 394.44186476135945, 422.70891766624965, 9055.094490551024, 9110.316726245557, 9155.679551215675, 9159.725208243763, 9306.90693093074, 414.84028648970366, 421.7511668115765, 434.85215026890376, 451.19236566545516, 463.7403054289609, 5456.208849716848, 5499.422560631157, 5508.118701007819, 5516.117421212587, 5535.059039963216, 348936.0, 421205.0, 428086.0, 431868.0, 433597.0, 35713.821430892676, 68682.08456361732, 69085.65457172682, 69596.6520167396, 70900.64549677321, 476.1191795178891, 482.53194401431256, 486.04734719949295, 486.21719032357873, 489.3784893185634, 9890.159336456481, 9967.900320996698, 9982.550785214538, 10001.949990250003, 10018.59925602997, 30117.69882301149, 31752.36495270128, 33204.0, 33345.66654333426, 34918.0, 38729.22541549097, 39099.804500978455, 39262.0, 42424.78787606042, 44708.0, 6018.729157188025, 6034.034554471264, 6061.696915154313, 6117.908231376622, 6122.969385153046, 10710.089642380484, 10896.50965706561, 11019.779604408028, 11110.888891111308, 11116.388598626829, 9142.634294628406, 9164.221041211571, 9607.039296070338, 9818.116369526777, 9928.156106731009, 9071.818563628822, 9093.636254549743, 9181.954090229507, 9258.259339252709, 9263.212626926786, 9285.953570232376, 9376.437413755197, 9381.765455863659, 9691.9030809691, 10012.949935250277, 5798.275215598051, 5813.738381772915, 5828.125781132694, 5844.824655260349, 5851.736671849691, 9537.237021038161, 9549.713508594754, 9637.37357071788, 9673.854892176763, 9778.364406313567], "dojo.html": [2712.7694145997584, 2761.8895244190235, 2790.023491777878, 2797.146870204588, 2818.661760588729, 4636.165490211761, 4830.975845120774, 4843.515648435159, 4869.561739443449, 4905.7547122643855, 4669.813207471697, 4744.4306683198065, 4752.310914917335, 4782.354382158407, 4852.854414367565, 4434.246178149722, 4492.348609451627, 4519.8418055368065, 4553.567411095957, 4591.9540804592025, 4565.703229290102, 4588.082383523292, 4616.976915115437, 4633.582977532022, 4678.43858736952, 4259.233337999159, 4294.828206871737, 4425.955740442619, 4426.889327766799, 4451.888702782424, 4451.265541185733, 4484.686071974963, 4513.7743112844555, 4515.006698526319, 4533.727976321398, 4240.830366785325, 4489.0, 4493.056458143794, 4496.505384407713, 4512.661550383701, 4623.2371658676275, 4664.230401983668, 4726.929096063562, 4761.666683332168, 4771.832985845479, 5216.843494695166, 5229.633925625208, 5239.580833533346, 5242.7640756166065, 5287.259783630257, 4965.478624744422, 5087.720175390352, 5262.710550919698, 5263.026340127089, 5270.92093618596, 4691.554302341272, 4756.048790241965, 4779.235322348408, 4808.663393562417, 4832.73419961902, 5367.463253674601, 5380.596455265871, 5384.6499977501335, 5412.648177868426, 5417.187421886749, 4876.853694389103, 4997.350344455198, 5147.6911385317, 5166.173412254021, 5200.089984252741, 5116.437191908887, 5120.308758317654, 5125.718085505258, 5135.281060651511, 5166.535011848951, 5050.469700681376, 5063.518965698253, 5068.4424713281505, 5073.289739436482, 5074.771635276422, 4859.222524396079, 4914.926276105862, 4995.150824359867, 5032.949670503322, 5065.39215294167, 3960.6237407446247, 3981.0843505993785, 3990.580988996114, 3998.280309544252, 4029.959700403017, 3549.6450354964295, 3565.108722819295, 3579.0873327301892, 3598.460230965376, 3603.657652523006, 4267.3812297217355, 4366.8908277292685, 4399.956000440018, 4482.731036137777, 4509.120721459284, 5218.425973142951, 5284.867878303073, 5296.09966305729, 5297.735113244323, 5306.151015837525, 4325.52419233884, 4524.660650451229, 4525.864224073283, 4532.32015197723, 4587.174308624413, 4504.369388285642, 4535.9773201133785, 4609.400777898852, 4615.492295847454, 4659.487456379796, 4928.802847886116, 5003.799848006184, 5030.647854650139, 5031.572316353005, 5066.493350664978, 4912.410510738734, 5091.0836049511445, 5310.628256022196, 5330.54690351309, 5377.865553361197, 4787.54518320759, 4850.7817148227705, 4882.389701287339, 4915.287283343967, 4939.678920870132, 5140.408852981955, 5157.045946499909, 5158.561522270649, 5173.534381905646, 5200.037992971161, 4940.555350018516, 5059.392872855134, 5243.947560524346, 5245.842624721265, 5267.236250743544, 4992.700437973734, 5080.898382032265, 5104.770285337243, 5109.131447653834, 5138.100832354397, 5070.4929507049, 5076.263941728503, 5084.38987321509, 5089.694618322913, 5094.337736094284, 4678.766061696833, 4764.8332308369045, 4846.200376937766, 4984.352034235526, 4998.850034498971, 5094.9490505095955, 5118.8976220476125, 5119.129747942933, 5127.974360128175, 5136.589072874086, 4982.576480999156, 4997.450280469073, 5002.87492812668, 5004.224345226496, 5004.924926126038], "mootools.html": [1358.2393859438712, 1420.4176287722032, 1515.651400177959, 1575.7793908852755, 1675.0619652994324, 7043.577385356876, 7186.425085993121, 7228.746993855216, 7243.348098671118, 7380.5940673263085, 7334.449916256275, 7363.779086627396, 7422.665980030898, 7428.739994100208, 7481.9251807481905, 2056.681214411765, 2082.9479263018393, 2091.0903756865737, 2095.4551816527737, 2095.947601309972, 2074.875507469557, 2083.9791602083938, 2086.8330533557278, 2121.590745045727, 2126.107035045277, 2005.2079428625684, 2018.6366454038268, 2030.4822270321122, 2092.95814083719, 2096.916123355064, 2017.1124705129696, 2071.87568745875, 2073.056759174587, 2093.706881036656, 2093.9844175574835, 2094.9057292421876, 2125.5855108253895, 2146.195176808697, 2149.795769401904, 2163.0266380128846, 7148.571085734872, 7217.314355136306, 7241.493095483318, 7256.129264488242, 7264.709411623581, 4127.938080928789, 4203.991042149893, 4216.2621541230465, 4218.641415479688, 4219.261629214906, 2825.0536070416433, 2852.7717782577342, 2882.8414437205947, 2904.997775767357, 2909.0690978886764, 870.5429649434035, 898.9820203595891, 908.8091500784843, 1743.450812993903, 1743.834335738103, 9689.51552422376, 9749.122578967856, 9794.853077203848, 9811.509424528816, 9819.558119884623, 3739.9252014960093, 3759.6616304532176, 3795.8291876865605, 3826.311263972456, 3910.354791459434, 7914.802129946797, 7915.0, 7917.208279172037, 7928.048634163822, 7938.841223175504, 4166.187593419254, 4168.478940132483, 4184.916301673949, 4194.874153775391, 4200.264953633163, 3753.9624603753614, 3777.490038844721, 3779.4519794629623, 3783.6594706476, 3790.3556395412847, 3184.4268031754505, 3193.9361212775616, 3210.7431405487505, 3224.2423030587793, 3227.0480208338595, 952.9332946693803, 960.8126415349079, 960.841461158901, 966.6326795817545, 971.1162841813915, 664.1200409457392, 730.5251586468731, 830.5265998380986, 862.3360012790116, 945.1540870920487, 6251.593646412968, 6252.155958945576, 6270.6864656766975, 6296.464800491918, 6296.874062518816, 569.9259096317452, 574.319431473705, 593.5696619950502, 597.1908064572528, 714.9463790215755, 4892.535209155125, 4912.140375434356, 4963.776630051656, 4996.07572599063, 5027.296178535008, 8193.0, 8320.459170154041, 8498.362622803192, 8530.957345213359, 8653.567321633893, 8577.485350878967, 8581.570921454027, 8594.269487093667, 8647.956760216159, 8654.437461564978, 6570.211574611173, 6618.63597502142, 6628.403443690091, 6635.834104147435, 6653.73385064592, 6312.400321969406, 6378.043293506012, 6392.584482008655, 6421.261554921057, 6427.614343139427, 7334.889976650461, 7568.091828980558, 7576.3938884887975, 7612.467127301035, 7648.847023059619, 7698.538087714755, 7745.7676269712, 7920.326772224425, 7924.167962364099, 7979.082405523439, 5925.407459254213, 6160.383961603804, 6233.470155036873, 6237.563370564017, 6249.625022498482, 6773.051772751917, 6836.692348844414, 6839.760608378683, 6865.073215115895, 6885.036094946611, 6257.68711564429, 6288.151099601495, 6367.7183501548825, 6411.839704007437, 6636.535442518977, 5678.68767217807, 6349.0476428536085, 6403.29563747978, 6449.838754031187, 6475.7733479328, 6281.59169653971, 6292.244930608356, 6332.746690132343, 6343.3022367538615, 6351.618902865843, 5734.2258795062135, 5815.302163740378, 5898.941010590011, 5900.203472531325, 5920.851978700394, 6050.45545900871, 6074.1799857020505, 6100.23747031621, 6101.969490152521, 6107.328193898578], "ext.html": [537.0172584170967, 542.6662602499464, 548.4069064994787, 582.5921854701709, 588.7409539802488, 36272.27455450893, 37041.814790926044, 37074.258514829686, 37130.443043354375, 37138.62861371389, 40205.396919046165, 40651.0, 40793.796031019876, 40821.795891020505, 40828.38757418641, 7891.368690504746, 8036.557989310615, 8048.074471435772, 8079.434439589231, 8093.190680931919, 7882.093559240703, 7995.720149794758, 8009.0, 8011.238932301422, 8030.7590772276635, 7946.16565260648, 8031.4377993540475, 8051.879221811678, 8061.798455038613, 8075.838483230332, 7765.378769698411, 7771.06747190338, 7816.8827467588035, 7849.01887264092, 7855.882161767549, 7804.336631386339, 7938.285554300141, 7959.801004974922, 8034.558099304536, 8052.677892884278, 38591.80704096489, 38963.0, 38999.025024374336, 39080.21839563221, 39192.0, 2751.2434080627786, 2753.2153336299057, 2790.972090279112, 2846.3453405716596, 2846.4307138572367, 28827.56758648622, 29255.70744292551, 29338.413231735245, 29404.705952940625, 29434.0, 2937.5299952007576, 2962.244627619943, 2992.730654241129, 3154.069549482908, 3162.762792790527, 229991.0, 230054.0, 230416.0, 231606.0, 231746.0, 41912.1617567647, 42415.0, 55182.72408637931, 56692.43307566954, 56920.0, 55933.601659958826, 55952.44047559554, 56165.15752263719, 56196.62820230799, 56359.0, 12513.186642868184, 12620.81068783969, 12654.493820247271, 12688.873111268953, 12691.492340306284, 9106.635734570675, 9129.315301352424, 9156.267498600097, 9162.496062716615, 9315.39449935752, 18523.44429667112, 18778.0, 18932.81067189338, 18974.335898243495, 19035.904820475807, 7603.581803000888, 7817.68729250835, 7844.568548729874, 7915.683372665144, 7935.92101055325, 783.5886159766169, 857.0872021297298, 869.7782065573239, 897.3449381951212, 984.0611907140374, 26423.603645945324, 26712.59931101035, 26762.0, 26879.193624191306, 26920.730792691822, 893.6425429827991, 918.7886786039248, 933.869258303838, 1073.1522097542854, 1085.0939465546198, 13572.1856688599, 13793.379297931617, 13908.165510069428, 13955.79066314006, 14154.221517816413, 266539.0, 270659.0, 272435.0, 272592.0, 272978.0, 46438.0, 46606.06787864291, 46768.5323146771, 46941.765291173324, 46998.530014700096, 1162.575659884153, 1187.6021532786613, 1196.9281843089616, 1199.1785626845638, 1200.0519589524354, 25313.367165821, 25964.740352596233, 25973.480530389665, 26616.7338326622, 26692.46615067649, 41067.58932410757, 41074.58925410708, 41437.79281103575, 41529.37705934353, 41581.79209104056, 254918.0, 255840.0, 257450.0, 258969.0, 258996.0, 30047.3990520184, 30270.697293026788, 30446.391072178874, 30554.236144096576, 30603.2349191272, 39584.802075989435, 40179.59820401875, 40276.0, 41111.38332925068, 41329.1734165321, 30036.24909377283, 31119.688803112585, 31904.84047579747, 32355.514667279538, 32704.182395440304, 33764.0, 33766.66233337635, 37267.81366093152, 40875.59124408837, 41733.791331043154, 33590.16024599405, 33676.66323336833, 33925.0, 34148.487772682936, 34173.82913085419, 36441.80919194221, 36611.0, 36847.44728829123, 36994.44508332323, 37698.0, 26215.0, 26726.465470690087, 26763.33091672724, 26839.463210736067, 27019.72980270172], "prototype.html": [283.6341119955257, 291.1730684855011, 293.6549554273728, 294.7332663939136, 295.0455277178329, 5554.0, 5643.746031428585, 5669.291338582677, 5711.0, 5730.627509211909, 5561.332640083186, 5596.832095037145, 5615.971920140393, 5629.943700563003, 5639.774409023645, 4334.198173337927, 4335.1329734053315, 4335.458067741532, 4344.956550434486, 4344.956550434486, 4320.762358070305, 4342.978285108586, 4348.804303806336, 4349.673774466912, 4361.302191649337, 4162.229987452331, 4296.742195468266, 4299.763513006784, 4304.526502084768, 4304.655627549789, 4289.313709806432, 4291.206126866539, 4299.5485474025245, 4301.1397720455725, 4301.2902871026245, 3751.3247615429214, 3751.606081361472, 3760.5863355030924, 3762.5108735864437, 3769.2838360711653, 5419.512243898029, 5433.266509021271, 5436.374816896028, 5438.646487978308, 5445.782168713246, 4581.358609794632, 4820.517948205186, 5012.248162775612, 5012.749362531858, 5016.147254966664, 5815.389384114649, 5816.0, 5982.641041537521, 5990.460858522711, 6026.96986515069, 4123.0, 4125.814338354781, 4128.236276288896, 4138.275801734684, 4143.274926887812, 6108.694565271719, 6208.906866397007, 6295.527835412317, 6296.0, 6309.116723658645, 4071.307877660805, 4083.816228269735, 4092.0383709828166, 4093.2222877653153, 4099.036726369301, 4125.731827431207, 4142.1922725068325, 4143.7720925349395, 4144.564820693844, 4155.625993660585, 4820.734859582757, 4836.298736683161, 4850.369451971292, 4852.975735121302, 4857.0043141155975, 5829.067349224104, 5939.406059394026, 5958.225430693982, 5978.372270911492, 5981.431763982415, 1478.22393243548, 1507.0279669613037, 1507.8492150785053, 1513.054341036852, 1514.1823415355584, 1013.3615822032073, 1014.6347314966606, 1020.5305559442739, 1036.1192985962023, 1036.5750042482546, 5112.105381558213, 5122.078025955289, 5128.538431541179, 5130.820421285237, 5134.743262836843, 6109.633421994695, 6110.572259941761, 6129.264488261437, 6131.202943617302, 6136.662483563447, 5133.743312834344, 5138.691678499227, 5142.434332223453, 5147.6911385317, 5156.639035267495, 3262.029718310511, 3286.3263031078573, 3318.286568387808, 3346.3140056288403, 3353.564036675217, 5791.536677065825, 5822.214001109881, 5823.155642431909, 5824.388439213906, 5840.649561026352, 6332.176817013758, 6351.777687780906, 6356.45970092538, 6366.331535188831, 6374.266959299647, 5687.51656109227, 5779.88440231193, 5791.82624521265, 5826.184334193216, 5827.999999999915, 6117.816465506042, 6152.0, 6153.600015998945, 6163.599366041193, 6165.784197553244, 5968.283805943314, 6003.099535069599, 6009.188759517584, 6009.87980240384, 6015.819525414245, 5740.282464691913, 5764.7405866736935, 5792.333881603669, 5801.274840644919, 5801.477866991822, 4007.559168491522, 4127.938080928729, 4141.130362623762, 4151.169766046743, 4153.709240353146, 6011.338752737108, 6168.845778855564, 6172.69136543162, 6176.505879529716, 6242.375762423903, 5994.07091900756, 6007.279126504673, 6014.218151640259, 6017.488513476404, 6027.427394397525, 6002.459778619946, 6003.129546215861, 6003.759849605967, 6005.3694362091355, 6009.2188015557695, 5697.886042279214, 5837.1244313351635, 5849.0, 5866.530677545701, 5887.116932460165, 6017.699115044143, 6022.45797878193, 6057.757689692363, 6070.3929607038945, 6077.0, 5878.941210587839, 5904.793332233351, 5906.232189815297, 5907.70461476933, 5910.497607703393], "yui.html": [547.3049227481101, 588.1648059755147, 590.0765302301897, 592.2360155399534, 594.1444320178942, 10577.418241996687, 10705.197110216726, 10796.028357447838, 10806.405647689393, 10861.782764344729, 9659.855102173473, 9698.17565506931, 11964.760704785898, 12136.271823690584, 12180.939095304511, 738.3096804487794, 749.2395218852841, 750.7184805697864, 767.8310771630232, 768.0514564512822, 747.4730315127849, 754.1327473405601, 756.0700338583518, 761.3034073822446, 763.480833033537, 778.7157687444098, 781.7771934998526, 790.2097902097902, 790.2334735306744, 791.6239786101613, 777.8599852026633, 780.0171783552707, 780.6721177105572, 781.9061712594497, 783.2206954080726, 571.342955601058, 576.6453631016936, 576.7635269539511, 579.7072478398424, 580.819945816794, 11037.83443248352, 11039.613613523568, 11115.221934464591, 11118.61084862026, 11122.221444498888, 8738.30093592511, 8739.082396348356, 8915.687950921687, 9136.08639136081, 9534.570944307523, 8669.436486628349, 8800.075992020873, 8875.245604123656, 9003.27973762104, 9011.143941325563, 2727.1682136948225, 2767.3635063935208, 2778.3880954758733, 2859.05651135127, 2864.6562412510425, 39461.802690986646, 40110.0, 40211.195776084605, 40248.19503609911, 40326.59673403258, 6545.672716364258, 6623.039659249382, 6636.601803891782, 6753.0, 6784.559003664746, 10420.583176673, 10424.947875260576, 10466.581336746445, 10646.36121832677, 10737.355758654505, 5711.571632127607, 5892.941070589325, 5921.851953701106, 5954.315253745788, 5966.761329546856, 3404.676555727202, 3562.495036925268, 3568.0544655666267, 3584.301061293075, 3615.313090512794, 2305.216226483004, 2319.315801838428, 2330.97669023311, 2341.9180328688412, 2341.988290058539, 381.35509494358973, 383.70838162996324, 386.9090763670535, 390.8983664247259, 392.131428885021, 449.3080655790047, 459.54734586432335, 463.5827755020441, 484.4186975629259, 512.6001718659452, 6337.144485494491, 6399.744010239631, 6536.444402225769, 6830.043793868862, 6869.107016087876, 441.45480331790213, 489.97839504632526, 516.633190434788, 548.8929658716512, 549.4532939724919, 3027.818330900153, 3194.07371862162, 3247.0745837436216, 3649.2154186849953, 3679.392900171495, 50872.49127508677, 55994.720026399606, 56119.0, 56355.43644563584, 56416.43583564194, 42942.570574294485, 43473.78263108728, 47660.52339476561, 47743.76128119337, 48046.27930581044, 38061.61938380636, 38313.42529862055, 38357.61642383596, 38564.61435385666, 38603.22793544114, 7176.892346614909, 7255.854882902418, 7675.961620191863, 7831.608419579112, 7986.081600616004, 30799.846000769852, 31363.686363136076, 31483.212919676276, 34132.82933585316, 34274.31451370909, 36892.26215475729, 38561.42157867578, 38632.80683596564, 40290.798546007085, 43859.0, 6640.966795165993, 6994.160700715946, 7072.25741297177, 7170.641467926478, 7297.201910793266, 10930.890691093306, 10939.507722152362, 11165.330080195214, 11231.943840281074, 11329.943350283196, 9351.298652601217, 9452.0, 9590.040995900634, 9966.651167209113, 9974.15219706304, 10401.58393664245, 10479.266451348332, 10552.20858435605, 10686.305390149615, 10871.836922446011, 10189.949050254701, 10254.333468324536, 10274.33216840903, 10431.791364172826, 10627.521761520595, 8779.20987111163, 8997.753791718982, 9070.274378049871, 9321.347505674537, 9356.391834530734, 8683.348748843988, 8733.694320698745, 8745.431546949429, 8791.692290769792, 8862.42394244372]}, "summary": {"lowerIsBetter": false, "suite": 5951.814060401225, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 5991.1025959687195, "unit": "ms", "value": 5991.1025959687195}, "dojo.html": {"lowerIsBetter": false, "filtered": 4730.300189108153, "unit": "ms", "value": 4730.300189108153}, "mootools.html": {"lowerIsBetter": false, "filtered": 4011.957558808009, "unit": "ms", "value": 4011.957558808009}, "ext.html": {"lowerIsBetter": false, "filtered": 16985.620886230867, "unit": "ms", "value": 16985.620886230867}, "prototype.html": {"lowerIsBetter": false, "filtered": 4419.484360219097, "unit": "ms", "value": 4419.484360219097}, "yui.html": {"lowerIsBetter": false, "filtered": 5207.740726797607, "unit": "ms", "value": 5207.740726797607}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-042.e"}, "testrun": {"date": 1447812921, "suite": "dromaeo_css", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151117174636", "branch": "Fx-Team-Non-PGO", "revision": "13ccab8d10bb6f6af421d1a5f95431df60bc3572"}}, {"talos_counters": {}, "results": {"audio-dft": [163.0, 163.0, 164.0, 162.0, 163.0, 168.0, 174.0, 162.0, 165.0, 163.0], "ai-astar": [115.0, 106.0, 111.0, 113.0, 112.0, 126.0, 112.0, 113.0, 112.0, 111.0], "imaging-gaussian-blur": [110.0, 111.0, 110.0, 110.0, 110.0, 110.0, 110.0, 118.0, 110.0, 110.0], "audio-beat-detection": [168.0, 148.0, 163.0, 162.0, 131.0, 153.0, 161.0, 140.0, 168.0, 133.0], "json-stringify-tinderbox": [68.0, 70.0, 70.0, 69.0, 69.0, 69.0, 70.0, 72.0, 69.0, 69.0], "stanford-crypto-pbkdf2": [136.0, 155.0, 147.0, 149.0, 147.0, 154.0, 161.0, 153.0, 148.0, 146.0], "json-parse-financial": [73.0, 73.0, 73.0, 74.0, 74.0, 72.0, 76.0, 73.0, 72.0, 72.0], "stanford-crypto-sha256-iterative": [73.0, 70.0, 72.0, 73.0, 76.0, 72.0, 71.0, 69.0, 73.0, 72.0], "audio-fft": [73.0, 72.0, 74.0, 73.0, 73.0, 136.0, 73.0, 73.0, 74.0, 73.0], "imaging-darkroom": [150.0, 149.0, 149.0, 150.0, 149.0, 149.0, 148.0, 150.0, 149.0, 151.0], "stanford-crypto-ccm": [128.0, 139.0, 124.0, 126.0, 144.0, 124.0, 138.0, 131.0, 127.0, 120.0], "audio-oscillator": [91.0, 90.0, 125.0, 91.0, 91.0, 92.0, 128.0, 91.0, 92.0, 127.0], "stanford-crypto-aes": [86.0, 82.0, 83.0, 83.0, 86.0, 84.0, 84.0, 86.0, 82.0, 99.0], "imaging-desaturate": [96.0, 97.0, 98.0, 96.0, 96.0, 96.0, 100.0, 101.0, 95.0, 97.0]}, "summary": {"lowerIsBetter": true, "suite": 1549.1999999999996, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 79.4, "unit": "ms", "value": 79.4}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 149.6, "unit": "ms", "value": 149.6}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 152.7, "unit": "ms", "value": 152.7}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 130.1, "unit": "ms", "value": 130.1}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 149.4, "unit": "ms", "value": 149.4}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 73.2, "unit": "ms", "value": 73.2}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 101.8, "unit": "ms", "value": 101.8}, "ai-astar": {"lowerIsBetter": true, "filtered": 113.1, "unit": "ms", "value": 113.1}, "audio-dft": {"lowerIsBetter": true, "filtered": 164.7, "unit": "ms", "value": 164.7}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 72.1, "unit": "ms", "value": 72.1}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 69.5, "unit": "ms", "value": 69.5}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 110.9, "unit": "ms", "value": 110.9}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 85.5, "unit": "ms", "value": 85.5}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 97.2, "unit": "ms", "value": 97.2}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-042.e"}, "testrun": {"date": 1447812921, "suite": "kraken", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151117174636", "branch": "Fx-Team-Non-PGO", "revision": "13ccab8d10bb6f6af421d1a5f95431df60bc3572"}}, {"talos_counters": {}, "results": {"DeltaBlue": [190.83969465648855], "Encrypt": [283.28611898017], "NavierStokes": [4840.579710144928], "Decrypt": [5050.251256281407], "Splay": [632.6402016383113], "Richards": [165.7550140891762], "RegExp": [26205.128205128207], "Earley": [698.3240223463687], "Boyer": [12444.444444444445], "RayTrace": [1054.8523206751054]}, "summary": {"lowerIsBetter": false, "suite": 21245.557516612273, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 346.45831999999996, "unit": "score", "value": 346.45831999999996}, "Encrypt": {"lowerIsBetter": false, "filtered": 939.6189299999998, "unit": "score", "value": 939.6189299999998}, "NavierStokes": {"lowerIsBetter": false, "filtered": 306.5748502994012, "unit": "score", "value": 306.5748502994012}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.70648656716413, "unit": "score", "value": 52.70648656716413}, "Splay": {"lowerIsBetter": false, "filtered": 128.81097310756977, "unit": "score", "value": 128.81097310756977}, "RegExp": {"lowerIsBetter": false, "filtered": 34.76361545988257, "unit": "score", "value": 34.76361545988257}, "Richards": {"lowerIsBetter": false, "filtered": 212.97696600000003, "unit": "score", "value": 212.97696600000003}, "Earley": {"lowerIsBetter": false, "filtered": 954.3750159999998, "unit": "score", "value": 954.3750159999998}, "Boyer": {"lowerIsBetter": false, "filtered": 53.555062500000005, "unit": "score", "value": 53.555062500000005}, "RayTrace": {"lowerIsBetter": false, "filtered": 701.5095719999998, "unit": "score", "value": 701.5095719999998}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-042.e"}, "testrun": {"date": 1447812921, "suite": "v8_7", "options": {"responsiveness": false, "tpmozafterpaint": false, "tpchrome": true, "tppagecycles": 1, "tpcycles": 1, "tprender": false, "shutdown": false, "cycles": 1, "rss": false}}, "test_build": {"name": "Firefox", "version": "45.0a1", "id": "20151117174636", "branch": "Fx-Team-Non-PGO", "revision": "13ccab8d10bb6f6af421d1a5f95431df60bc3572"}}] 18:35:40 INFO - RETURN: dromaeo_css: 5951.81 18:35:40 INFO - RETURN: kraken: 1549.20 18:35:40 INFO - RETURN: v8_7: 21245.56 18:35:40 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,43]]", "result": "21245.56"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,43]]", "result": "1549.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,43]]", "result": "5951.81"}}} 18:35:40 INFO - Return code: 0 18:35:40 INFO - # TBPL SUCCESS # 18:35:40 INFO - Running post-action listener: _resource_record_post_action 18:35:40 INFO - Running post-run listener: _resource_record_post_run 18:35:41 INFO - Total resource usage - Wall time: 1233s; CPU: 13.0%; Read bytes: 4096; Write bytes: 511504384; Read time: 8; Write time: 696988 18:35:41 INFO - install - Wall time: 15s; CPU: 14.0%; Read bytes: 0; Write bytes: 136441856; Read time: 0; Write time: 149652 18:35:41 INFO - run-tests - Wall time: 1219s; CPU: 13.0%; Read bytes: 4096; Write bytes: 374493184; Read time: 8; Write time: 547296 18:35:41 INFO - Running post-run listener: _upload_blobber_files 18:35:41 INFO - Blob upload gear active. 18:35:41 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 18:35:41 INFO - Copying logs to upload dir... 18:35:41 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1263.901367 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 3 secs) (at 2015-11-17 18:35:41.047823) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-17 18:35:41.051443) ========= 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=c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010075 build_url: 'https://queue.taskcluster.net/v1/task/dXRb6yFRTp6THeRzLXYWGA/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-17 18:35:41.103027) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 18:35:41.103356) ========= 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=c402a24d74c70935940d60dd000001de-1447810947.232796-1398907854 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004816 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 18:35:41.152635) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-17 18:35:41.152935) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-17 18:35:41.153215) ========= ========= Total master_lag: 0.23 =========