builder: fx-team_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-053 starttime: 1447300145.81 results: success (0) buildid: 20151111173002 builduid: 8b8c238627d14a1e93cbcc02494c4e85 revision: 5f9371f97e1e21f10fa20b39f33774116cfcf5f0 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:05.813842) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:05.814835) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:05.815184) ========= bash -c pwd in dir /builds/slave/test-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=919420d7ee4ef147bef0346300000385-1447297652.317436-549066302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006502 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:05.844207) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:05.844562) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:05.952688) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:05.953008) ========= rm -rf properties in dir /builds/slave/test-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=919420d7ee4ef147bef0346300000385-1447297652.317436-549066302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020510 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.006860) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.007197) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.007591) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.007928) ========= 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-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=919420d7ee4ef147bef0346300000385-1447297652.317436-549066302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-11 19:49:06-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 43.6M=0s 2015-11-11 19:49:06 (43.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.179005 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.200463) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.200859) ========= rm -rf scripts in dir /builds/slave/test-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=919420d7ee4ef147bef0346300000385-1447297652.317436-549066302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.086914 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.299854) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.300270) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 5f9371f97e1e21f10fa20b39f33774116cfcf5f0 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 5f9371f97e1e21f10fa20b39f33774116cfcf5f0 --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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=919420d7ee4ef147bef0346300000385-1447297652.317436-549066302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-11 19:49:06,437 truncating revision to first 12 chars 2015-11-11 19:49:06,437 Setting DEBUG logging. 2015-11-11 19:49:06,437 attempt 1/10 2015-11-11 19:49:06,437 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/5f9371f97e1e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-11 19:49:06,662 unpacking tar archive at: fx-team-5f9371f97e1e/testing/mozharness/ program finished with exit code 0 elapsedTime=0.522673 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.836457) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.836833) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.851559) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.851889) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-11 19:49:06.852338) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 2 secs) (at 2015-11-11 19:49:06.852663) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=919420d7ee4ef147bef0346300000385-1447297652.317436-549066302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 19:49:07 INFO - MultiFileLogger online at 20151111 19:49:07 in /builds/slave/test-pgo 19:49:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 19:49:07 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 19:49:07 INFO - {'append_to_log': False, 19:49:07 INFO - 'base_work_dir': '/builds/slave/test-pgo', 19:49:07 INFO - 'blob_upload_branch': 'Fx-Team', 19:49:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 19:49:07 INFO - 'branch': 'Fx-Team', 19:49:07 INFO - 'buildbot_json_path': 'buildprops.json', 19:49:07 INFO - 'config_files': ('talos/linux_config.py',), 19:49:07 INFO - 'default_actions': ('clobber', 19:49:07 INFO - 'read-buildbot-config', 19:49:07 INFO - 'download-and-extract', 19:49:07 INFO - 'populate-webroot', 19:49:07 INFO - 'create-virtualenv', 19:49:07 INFO - 'install', 19:49:07 INFO - 'run-tests'), 19:49:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:49:07 INFO - 'download_minidump_stackwalk': True, 19:49:07 INFO - 'download_symbols': 'ondemand', 19:49:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:49:07 INFO - 'tooltool.py': '/tools/tooltool.py', 19:49:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:49:07 INFO - '/tools/misc-python/virtualenv.py')}, 19:49:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:49:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:49:07 INFO - 'installer_path': 'installer.exe', 19:49:07 INFO - 'log_level': 'info', 19:49:07 INFO - 'log_name': 'talos', 19:49:07 INFO - 'log_to_console': True, 19:49:07 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 19:49:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 19:49:07 INFO - 'opt_config_files': (), 19:49:07 INFO - 'pip_index': False, 19:49:07 INFO - 'sps_profile': False, 19:49:07 INFO - 'sps_profile_interval': 0, 19:49:07 INFO - 'suite': 'dromaeojs', 19:49:07 INFO - 'system_bits': '64', 19:49:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:49:07 INFO - 'title': 'talos-linux64-ix-053', 19:49:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:49:07 INFO - 'use_talos_json': True, 19:49:07 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 19:49:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:49:07 INFO - 'work_dir': 'build'} 19:49:07 INFO - ##### 19:49:07 INFO - ##### Running clobber step. 19:49:07 INFO - ##### 19:49:07 INFO - Running pre-action listener: _resource_record_pre_action 19:49:07 INFO - Running main action method: clobber 19:49:07 INFO - rmtree: /builds/slave/test-pgo/build 19:49:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 19:49:08 INFO - Running post-action listener: _resource_record_post_action 19:49:08 INFO - ##### 19:49:08 INFO - ##### Running read-buildbot-config step. 19:49:08 INFO - ##### 19:49:08 INFO - Running pre-action listener: _resource_record_pre_action 19:49:08 INFO - Running main action method: read_buildbot_config 19:49:08 INFO - Using buildbot properties: 19:49:08 INFO - { 19:49:08 INFO - "properties": { 19:49:08 INFO - "buildnumber": 323, 19:49:08 INFO - "product": "firefox", 19:49:08 INFO - "script_repo_revision": "production", 19:49:08 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 19:49:08 INFO - "repository": "", 19:49:08 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs", 19:49:08 INFO - "buildid": "20151111173002", 19:49:08 INFO - "slavename": "talos-linux64-ix-053", 19:49:08 INFO - "pgo_build": "True", 19:49:08 INFO - "basedir": "/builds/slave/test-pgo", 19:49:08 INFO - "project": "", 19:49:08 INFO - "platform": "ubuntu64_hw", 19:49:08 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 19:49:08 INFO - "slavebuilddir": "test", 19:49:08 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 19:49:08 INFO - "branch": "fx-team", 19:49:08 INFO - "repo_path": "integration/fx-team", 19:49:08 INFO - "stage_platform": "linux64-pgo", 19:49:08 INFO - "builduid": "8b8c238627d14a1e93cbcc02494c4e85", 19:49:08 INFO - "revision": "5f9371f97e1e21f10fa20b39f33774116cfcf5f0" 19:49:08 INFO - }, 19:49:08 INFO - "sourcestamp": { 19:49:08 INFO - "repository": "", 19:49:08 INFO - "hasPatch": false, 19:49:08 INFO - "project": "", 19:49:08 INFO - "branch": "fx-team-linux64-pgo-talos", 19:49:08 INFO - "changes": [ 19:49:08 INFO - { 19:49:08 INFO - "category": null, 19:49:08 INFO - "files": [ 19:49:08 INFO - { 19:49:08 INFO - "url": null, 19:49:08 INFO - "name": "https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 19:49:08 INFO - } 19:49:08 INFO - ], 19:49:08 INFO - "repository": "", 19:49:08 INFO - "rev": "5f9371f97e1e21f10fa20b39f33774116cfcf5f0", 19:49:08 INFO - "who": "sendchange", 19:49:08 INFO - "when": 1447300068, 19:49:08 INFO - "number": 6651886, 19:49:08 INFO - "comments": "", 19:49:08 INFO - "project": "", 19:49:08 INFO - "at": "Wed 11 Nov 2015 19:47:48", 19:49:08 INFO - "branch": "fx-team-linux64-pgo-talos", 19:49:08 INFO - "revlink": "", 19:49:08 INFO - "properties": [ 19:49:08 INFO - [ 19:49:08 INFO - "buildid", 19:49:08 INFO - "20151111173002", 19:49:08 INFO - "Change" 19:49:08 INFO - ], 19:49:08 INFO - [ 19:49:08 INFO - "builduid", 19:49:08 INFO - "8b8c238627d14a1e93cbcc02494c4e85", 19:49:08 INFO - "Change" 19:49:08 INFO - ], 19:49:08 INFO - [ 19:49:08 INFO - "pgo_build", 19:49:08 INFO - "True", 19:49:08 INFO - "Change" 19:49:08 INFO - ] 19:49:08 INFO - ], 19:49:08 INFO - "revision": "5f9371f97e1e21f10fa20b39f33774116cfcf5f0" 19:49:08 INFO - } 19:49:08 INFO - ], 19:49:08 INFO - "revision": "5f9371f97e1e21f10fa20b39f33774116cfcf5f0" 19:49:08 INFO - } 19:49:08 INFO - } 19:49:08 INFO - Found installer url https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 19:49:08 INFO - Running post-action listener: _resource_record_post_action 19:49:08 INFO - ##### 19:49:08 INFO - ##### Running download-and-extract step. 19:49:08 INFO - ##### 19:49:08 INFO - Running pre-action listener: _resource_record_pre_action 19:49:08 INFO - Running main action method: download_and_extract 19:49:08 INFO - mkdir: /builds/slave/test-pgo/build/tests 19:49:08 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')]} 19:49:08 INFO - https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 19:49:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/test_packages.json 19:49:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/test_packages.json 19:49:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 19:49:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 19:49:08 INFO - Downloaded 1302 bytes. 19:49:08 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 19:49:08 INFO - Using the following test package requirements: 19:49:08 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 19:49:08 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:49:08 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 19:49:08 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:49:08 INFO - u'jsshell-linux-x86_64.zip'], 19:49:08 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:49:08 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 19:49:08 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 19:49:08 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:49:08 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 19:49:08 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:49:08 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 19:49:08 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:49:08 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 19:49:08 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 19:49:08 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 19:49:08 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 19:49:08 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 19:49:08 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')]} 19:49:08 INFO - https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:49:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:49:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:49:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:49:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:49:10 INFO - Downloaded 22438609 bytes. 19:49:10 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 19:49:10 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:49:10 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 19:49:11 INFO - Return code: 0 19:49:11 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 19:49:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:11 INFO - https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:49:11 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:49:11 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:49:11 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:49:11 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:49:15 INFO - Downloaded 22438609 bytes. 19:49:15 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test-pgo/build/tests 19:49:15 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 19:49:15 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 19:49:16 INFO - Return code: 0 19:49:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:16 INFO - https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 19:49:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:49:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:49:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:49:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 19:49:17 INFO - Downloaded 11131693 bytes. 19:49:17 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test-pgo/build/tests 19:49:17 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 19:49:17 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 19:49:17 INFO - Return code: 0 19:49:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:17 INFO - https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 19:49:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:49:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:49:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:49:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 19:49:19 INFO - Downloaded 57166026 bytes. 19:49:19 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:49:19 INFO - mkdir: /builds/slave/test-pgo/properties 19:49:19 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 19:49:19 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 19:49:19 INFO - Contents: 19:49:19 INFO - build_url:https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 19:49:19 INFO - Running post-action listener: _resource_record_post_action 19:49:19 INFO - Running post-action listener: set_extra_try_arguments 19:49:19 INFO - ##### 19:49:19 INFO - ##### Running populate-webroot step. 19:49:19 INFO - ##### 19:49:19 INFO - Running pre-action listener: _resource_record_pre_action 19:49:19 INFO - Running main action method: populate_webroot 19:49:19 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:49:19 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:49:19 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 19:49:19 INFO - '../fennec_ids.txt'], 19:49:19 INFO - 'tests': ['tcheck2']}, 19:49:19 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:49:19 INFO - '--tppagecycles', 19:49:19 INFO - '7'], 19:49:19 INFO - 'tests': ['tsvgm']}}, 19:49:19 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 19:49:19 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 19:49:19 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:49:19 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:49:19 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 19:49:19 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 19:49:19 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:49:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:49:19 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:49:19 INFO - 'talos_options': ['--e10s'], 19:49:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:49:19 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:49:19 INFO - 'tests': ['damp', 'tps']}, 19:49:19 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:49:19 INFO - 'talos_options': ['--e10s'], 19:49:19 INFO - 'tests': ['damp', 'tps']}, 19:49:19 INFO - 'g3': {'tests': ['dromaeo_dom']}, 19:49:19 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:49:19 INFO - 'other': {'tests': ['a11yr', 19:49:19 INFO - 'ts_paint', 19:49:19 INFO - 'tpaint', 19:49:19 INFO - 'sessionrestore', 19:49:19 INFO - 'sessionrestore_no_auto_restore']}, 19:49:19 INFO - 'other-e10s': {'talos_options': ['--e10s'], 19:49:19 INFO - 'tests': ['a11yr', 19:49:19 INFO - 'ts_paint', 19:49:19 INFO - 'tpaint', 19:49:19 INFO - 'sessionrestore', 19:49:19 INFO - 'sessionrestore_no_auto_restore']}, 19:49:19 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 19:49:19 INFO - 'tests': ['a11yr', 19:49:19 INFO - 'ts_paint', 19:49:19 INFO - 'tpaint', 19:49:19 INFO - 'sessionrestore', 19:49:19 INFO - 'sessionrestore_no_auto_restore']}, 19:49:19 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 19:49:19 INFO - 'tests': ['a11yr', 19:49:19 INFO - 'ts_paint', 19:49:19 INFO - 'tpaint', 19:49:19 INFO - 'sessionrestore', 19:49:19 INFO - 'sessionrestore_no_auto_restore']}, 19:49:19 INFO - 'other_l64': {'tests': ['a11yr', 19:49:19 INFO - 'ts_paint', 19:49:19 INFO - 'tpaint', 19:49:19 INFO - 'sessionrestore', 19:49:19 INFO - 'sessionrestore_no_auto_restore']}, 19:49:19 INFO - 'other_nol64': {'tests': ['a11yr', 19:49:19 INFO - 'ts_paint', 19:49:19 INFO - 'tpaint', 19:49:19 INFO - 'sessionrestore', 19:49:19 INFO - 'sessionrestore_no_auto_restore']}, 19:49:19 INFO - 'svgr': {'tests': ['tsvgx', 19:49:19 INFO - 'tsvgr_opacity', 19:49:19 INFO - 'tart', 19:49:19 INFO - 'tscrollx', 19:49:19 INFO - 'cart']}, 19:49:19 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 19:49:19 INFO - 'tests': ['tsvgx', 19:49:19 INFO - 'tsvgr_opacity', 19:49:19 INFO - 'tart', 19:49:19 INFO - 'tscrollx', 19:49:19 INFO - 'cart']}, 19:49:19 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:49:19 INFO - 'tests': ['tp5o']}, 19:49:19 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:49:19 INFO - 'talos_options': ['--e10s'], 19:49:19 INFO - 'tests': ['tp5o']}, 19:49:19 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:49:19 INFO - 'talos_options': ['--xperf_path', 19:49:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:49:19 INFO - 'tests': ['tp5n']}, 19:49:19 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:49:19 INFO - 'talos_options': ['--e10s', 19:49:19 INFO - '--xperf_path', 19:49:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:49:19 INFO - 'tests': ['tp5n']}}, 19:49:19 INFO - 'talos.zip': {'path': '', 19:49:19 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:49:19 INFO - Running post-action listener: _resource_record_post_action 19:49:19 INFO - ##### 19:49:19 INFO - ##### Running create-virtualenv step. 19:49:19 INFO - ##### 19:49:19 INFO - Running pre-action listener: _resource_record_pre_action 19:49:19 INFO - Running main action method: create_virtualenv 19:49:19 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 19:49:19 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 19:49:19 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 19:49:19 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:49:19 INFO - Using real prefix '/usr' 19:49:19 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 19:49:19 INFO - Installing distribute.............................................................................................................................................................................................done. 19:49:22 INFO - Installing pip.................done. 19:49:22 INFO - Return code: 0 19:49:22 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 19:49:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:49:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:49:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:22 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/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 0x7f0422fc3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f36c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22b46e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22eaa90>, '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 0x233cf70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x233d2e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 19:49:22 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/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-pgo/build 19:49:22 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/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 19:49:22 INFO - Using env: {'DISPLAY': ':0', 19:49:22 INFO - 'HOME': '/home/cltbld', 19:49:22 INFO - 'LANG': 'en_US.UTF-8', 19:49:22 INFO - 'LANGUAGE': 'en_US:en', 19:49:22 INFO - 'LOGNAME': 'cltbld', 19:49:22 INFO - 'MAIL': '/var/mail/cltbld', 19:49:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:49:22 INFO - 'MOZ_NO_REMOTE': '1', 19:49:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:49:22 INFO - 'NO_EM_RESTART': '1', 19:49:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:49:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:49:22 INFO - 'PWD': '/builds/slave/test-pgo', 19:49:22 INFO - 'SHELL': '/bin/bash', 19:49:22 INFO - 'SHLVL': '1', 19:49:22 INFO - 'TERM': 'linux', 19:49:22 INFO - 'TMOUT': '86400', 19:49:22 INFO - 'USER': 'cltbld', 19:49:22 INFO - 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', 19:49:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:49:22 INFO - '_': '/tools/buildbot/bin/python'} 19:49:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:49:22 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 19:49:22 INFO - Cleaning up... 19:49:22 INFO - Return code: 0 19:49:22 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 19:49:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:49:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:49:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:22 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/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 0x7f0422fc3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f36c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22b46e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22eaa90>, '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 0x233cf70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x233d2e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 19:49:22 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/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-pgo/build 19:49:22 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/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 19:49:22 INFO - Using env: {'DISPLAY': ':0', 19:49:22 INFO - 'HOME': '/home/cltbld', 19:49:22 INFO - 'LANG': 'en_US.UTF-8', 19:49:22 INFO - 'LANGUAGE': 'en_US:en', 19:49:22 INFO - 'LOGNAME': 'cltbld', 19:49:22 INFO - 'MAIL': '/var/mail/cltbld', 19:49:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:49:22 INFO - 'MOZ_NO_REMOTE': '1', 19:49:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:49:22 INFO - 'NO_EM_RESTART': '1', 19:49:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:49:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:49:22 INFO - 'PWD': '/builds/slave/test-pgo', 19:49:22 INFO - 'SHELL': '/bin/bash', 19:49:22 INFO - 'SHLVL': '1', 19:49:22 INFO - 'TERM': 'linux', 19:49:22 INFO - 'TMOUT': '86400', 19:49:22 INFO - 'USER': 'cltbld', 19:49:22 INFO - 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', 19:49:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:49:22 INFO - '_': '/tools/buildbot/bin/python'} 19:49:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:49:22 INFO - Downloading/unpacking psutil>=0.7.1 19:49:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:24 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 19:49:24 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 19:49:24 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 19:49:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:49:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:49:24 INFO - Installing collected packages: psutil 19:49:24 INFO - Running setup.py install for psutil 19:49:24 INFO - building 'psutil._psutil_linux' extension 19:49:24 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 19:49:24 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 19:49:24 INFO - building 'psutil._psutil_posix' extension 19:49:24 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 19:49:24 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 19:49:24 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:49:24 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:49:24 INFO - Successfully installed psutil 19:49:24 INFO - Cleaning up... 19:49:25 INFO - Return code: 0 19:49:25 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 19:49:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:49:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:49:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:25 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/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 0x7f0422fc3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f36c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22b46e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22eaa90>, '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 0x233cf70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x233d2e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 19:49:25 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/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-pgo/build 19:49:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/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 19:49:25 INFO - Using env: {'DISPLAY': ':0', 19:49:25 INFO - 'HOME': '/home/cltbld', 19:49:25 INFO - 'LANG': 'en_US.UTF-8', 19:49:25 INFO - 'LANGUAGE': 'en_US:en', 19:49:25 INFO - 'LOGNAME': 'cltbld', 19:49:25 INFO - 'MAIL': '/var/mail/cltbld', 19:49:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:49:25 INFO - 'MOZ_NO_REMOTE': '1', 19:49:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:49:25 INFO - 'NO_EM_RESTART': '1', 19:49:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:49:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:49:25 INFO - 'PWD': '/builds/slave/test-pgo', 19:49:25 INFO - 'SHELL': '/bin/bash', 19:49:25 INFO - 'SHLVL': '1', 19:49:25 INFO - 'TERM': 'linux', 19:49:25 INFO - 'TMOUT': '86400', 19:49:25 INFO - 'USER': 'cltbld', 19:49:25 INFO - 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', 19:49:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:49:25 INFO - '_': '/tools/buildbot/bin/python'} 19:49:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:49:25 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 19:49:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:26 INFO - Downloading mozsystemmonitor-0.0.tar.gz 19:49:26 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 19:49:26 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:49:26 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 19:49:26 INFO - Installing collected packages: mozsystemmonitor 19:49:26 INFO - Running setup.py install for mozsystemmonitor 19:49:27 INFO - Successfully installed mozsystemmonitor 19:49:27 INFO - Cleaning up... 19:49:28 INFO - Return code: 0 19:49:28 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 19:49:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:49:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:49:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:28 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/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 0x7f0422fc3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f36c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22b46e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22eaa90>, '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 0x233cf70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x233d2e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 19:49:28 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/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-pgo/build 19:49:28 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/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 19:49:28 INFO - Using env: {'DISPLAY': ':0', 19:49:28 INFO - 'HOME': '/home/cltbld', 19:49:28 INFO - 'LANG': 'en_US.UTF-8', 19:49:28 INFO - 'LANGUAGE': 'en_US:en', 19:49:28 INFO - 'LOGNAME': 'cltbld', 19:49:28 INFO - 'MAIL': '/var/mail/cltbld', 19:49:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:49:28 INFO - 'MOZ_NO_REMOTE': '1', 19:49:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:49:28 INFO - 'NO_EM_RESTART': '1', 19:49:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:49:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:49:28 INFO - 'PWD': '/builds/slave/test-pgo', 19:49:28 INFO - 'SHELL': '/bin/bash', 19:49:28 INFO - 'SHLVL': '1', 19:49:28 INFO - 'TERM': 'linux', 19:49:28 INFO - 'TMOUT': '86400', 19:49:28 INFO - 'USER': 'cltbld', 19:49:28 INFO - 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', 19:49:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:49:28 INFO - '_': '/tools/buildbot/bin/python'} 19:49:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:49:28 INFO - Downloading/unpacking blobuploader==1.2.4 19:49:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:29 INFO - Downloading blobuploader-1.2.4.tar.gz 19:49:29 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 19:49:29 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:49:29 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:49:29 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 19:49:29 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 19:49:29 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 19:49:29 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 19:49:29 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 19:49:29 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 19:49:30 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 19:49:30 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 19:49:30 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:49:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:30 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:30 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:30 INFO - Downloading docopt-0.6.1.tar.gz 19:49:30 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 19:49:30 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 19:49:30 INFO - Installing collected packages: blobuploader, requests, docopt 19:49:30 INFO - Running setup.py install for blobuploader 19:49:30 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:49:30 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 19:49:30 INFO - Running setup.py install for requests 19:49:31 INFO - Running setup.py install for docopt 19:49:31 INFO - Successfully installed blobuploader requests docopt 19:49:31 INFO - Cleaning up... 19:49:31 INFO - Return code: 0 19:49:31 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:49:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:49:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:49:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:49:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:31 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/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 0x7f0422fc3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f36c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22b46e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22eaa90>, '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 0x233cf70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x233d2e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 19:49:31 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/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-pgo/build/tests/config 19:49:31 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/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 19:49:31 INFO - Using env: {'DISPLAY': ':0', 19:49:31 INFO - 'HOME': '/home/cltbld', 19:49:31 INFO - 'LANG': 'en_US.UTF-8', 19:49:31 INFO - 'LANGUAGE': 'en_US:en', 19:49:31 INFO - 'LOGNAME': 'cltbld', 19:49:31 INFO - 'MAIL': '/var/mail/cltbld', 19:49:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:49:31 INFO - 'MOZ_NO_REMOTE': '1', 19:49:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:49:31 INFO - 'NO_EM_RESTART': '1', 19:49:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:49:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:49:31 INFO - 'PWD': '/builds/slave/test-pgo', 19:49:31 INFO - 'SHELL': '/bin/bash', 19:49:31 INFO - 'SHLVL': '1', 19:49:31 INFO - 'TERM': 'linux', 19:49:31 INFO - 'TMOUT': '86400', 19:49:31 INFO - 'USER': 'cltbld', 19:49:31 INFO - 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', 19:49:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:49:31 INFO - '_': '/tools/buildbot/bin/python'} 19:49:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:49:31 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:49:31 INFO - Running setup.py (path:/tmp/pip-IW27vG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:49:31 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:49:31 INFO - Running setup.py (path:/tmp/pip-pbYFuU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:49:31 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:49:31 INFO - Running setup.py (path:/tmp/pip-8RCSTW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:49:31 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:49:31 INFO - Running setup.py (path:/tmp/pip-7pGiOv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:49:31 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 19:49:31 INFO - Running setup.py (path:/tmp/pip-We_Pzc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 19:49:31 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:49:31 INFO - Running setup.py (path:/tmp/pip-YlIDOt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:49:31 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:49:31 INFO - Running setup.py (path:/tmp/pip-dBuOsO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:49:31 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:49:31 INFO - Running setup.py (path:/tmp/pip-xwdZMz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:49:31 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 19:49:31 INFO - Running setup.py (path:/tmp/pip-NJIBc5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 19:49:32 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 19:49:32 INFO - Running setup.py (path:/tmp/pip-tJoeUj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 19:49:32 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:49:32 INFO - Running setup.py (path:/tmp/pip-kebIk5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:49:32 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:49:32 INFO - Running setup.py (path:/tmp/pip-Gq2i6S-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:49:32 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:49:32 INFO - Running setup.py (path:/tmp/pip-pEGlG4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:49:32 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:49:32 INFO - Running setup.py (path:/tmp/pip-LIbT8m-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:49:32 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:49:32 INFO - Running setup.py (path:/tmp/pip-iUh2II-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:49:32 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 19:49:32 INFO - Running setup.py (path:/tmp/pip-s_gCwS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 19:49:32 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 19:49:32 INFO - Running setup.py (path:/tmp/pip-MzJz2j-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 19:49:32 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:49:32 INFO - Running setup.py install for manifestparser 19:49:32 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 19:49:32 INFO - Running setup.py install for mozcrash 19:49:32 INFO - Running setup.py install for mozdebug 19:49:32 INFO - Running setup.py install for mozdevice 19:49:33 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Running setup.py install for mozfile 19:49:33 INFO - Running setup.py install for mozhttpd 19:49:33 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Running setup.py install for mozinfo 19:49:33 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Running setup.py install for mozInstall 19:49:33 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Running setup.py install for mozleak 19:49:33 INFO - Running setup.py install for mozlog 19:49:33 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Running setup.py install for moznetwork 19:49:33 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Running setup.py install for mozprocess 19:49:33 INFO - Running setup.py install for mozprofile 19:49:33 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 19:49:33 INFO - Running setup.py install for mozrunner 19:49:34 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 19:49:34 INFO - Running setup.py install for mozscreenshot 19:49:34 INFO - Running setup.py install for moztest 19:49:34 INFO - Running setup.py install for mozversion 19:49:34 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 19:49:34 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:49:34 INFO - Cleaning up... 19:49:34 INFO - Return code: 0 19:49:34 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:49:34 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')]} 19:49:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:49:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:34 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')]} 19:49:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:49:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:34 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/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 0x7f0422fc3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f36c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22b46e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22eaa90>, '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 0x233cf70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x233d2e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 19:49:34 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/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-pgo/build/tests/config 19:49:34 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/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 19:49:34 INFO - Using env: {'DISPLAY': ':0', 19:49:34 INFO - 'HOME': '/home/cltbld', 19:49:34 INFO - 'LANG': 'en_US.UTF-8', 19:49:34 INFO - 'LANGUAGE': 'en_US:en', 19:49:34 INFO - 'LOGNAME': 'cltbld', 19:49:34 INFO - 'MAIL': '/var/mail/cltbld', 19:49:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:49:34 INFO - 'MOZ_NO_REMOTE': '1', 19:49:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:49:34 INFO - 'NO_EM_RESTART': '1', 19:49:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:49:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:49:34 INFO - 'PWD': '/builds/slave/test-pgo', 19:49:34 INFO - 'SHELL': '/bin/bash', 19:49:34 INFO - 'SHLVL': '1', 19:49:34 INFO - 'TERM': 'linux', 19:49:34 INFO - 'TMOUT': '86400', 19:49:34 INFO - 'USER': 'cltbld', 19:49:34 INFO - 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', 19:49:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:49:34 INFO - '_': '/tools/buildbot/bin/python'} 19:49:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:49:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:49:34 INFO - Running setup.py (path:/tmp/pip-SdKZ_a-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:49:34 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 19:49:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:49:34 INFO - Running setup.py (path:/tmp/pip-zxJXBu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:49:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 19:49:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:49:34 INFO - Running setup.py (path:/tmp/pip-62kOr9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:49:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 19:49:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:49:34 INFO - Running setup.py (path:/tmp/pip-O7U1SG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:49:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 19:49:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 19:49:34 INFO - Running setup.py (path:/tmp/pip-yK88qf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 19:49:34 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 19:49:34 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:49:35 INFO - Running setup.py (path:/tmp/pip-UM3Ag2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:49:35 INFO - Running setup.py (path:/tmp/pip-iyFjf9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:49:35 INFO - Running setup.py (path:/tmp/pip-zkFDjf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 19:49:35 INFO - Running setup.py (path:/tmp/pip-UmHES5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 19:49:35 INFO - Running setup.py (path:/tmp/pip-qjkBEh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:49:35 INFO - Running setup.py (path:/tmp/pip-XT49jJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:49:35 INFO - Running setup.py (path:/tmp/pip-lJZSyJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:49:35 INFO - Running setup.py (path:/tmp/pip-4ypAaA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:49:35 INFO - Running setup.py (path:/tmp/pip-SETQYH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:49:35 INFO - Running setup.py (path:/tmp/pip-ntpkAQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 19:49:35 INFO - Running setup.py (path:/tmp/pip-o1wa4I-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 19:49:35 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 19:49:35 INFO - Running setup.py (path:/tmp/pip-zP916T-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 19:49:35 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 19:49:35 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 19:49:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:49:35 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:49:35 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:49:37 INFO - Downloading blessings-1.5.1.tar.gz 19:49:37 INFO - Storing download in cache at /builds/slave/test-pgo/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 19:49:37 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 19:49:37 INFO - Installing collected packages: blessings 19:49:37 INFO - Running setup.py install for blessings 19:49:37 INFO - Successfully installed blessings 19:49:37 INFO - Cleaning up... 19:49:37 INFO - Return code: 0 19:49:37 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 19:49:37 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 19:49:37 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 19:49:37 INFO - Reading from file tmpfile_stdout 19:49:37 INFO - Current package versions: 19:49:37 INFO - argparse == 1.2.1 19:49:37 INFO - blessings == 1.5.1 19:49:37 INFO - blobuploader == 1.2.4 19:49:37 INFO - docopt == 0.6.1 19:49:37 INFO - manifestparser == 1.1 19:49:37 INFO - mozInstall == 1.12 19:49:37 INFO - mozcrash == 0.16 19:49:37 INFO - mozdebug == 0.1 19:49:37 INFO - mozdevice == 0.47 19:49:37 INFO - mozfile == 1.2 19:49:37 INFO - mozhttpd == 0.7 19:49:37 INFO - mozinfo == 0.9 19:49:37 INFO - mozleak == 0.1 19:49:37 INFO - mozlog == 3.0 19:49:37 INFO - moznetwork == 0.27 19:49:37 INFO - mozprocess == 0.22 19:49:37 INFO - mozprofile == 0.27 19:49:37 INFO - mozrunner == 6.11 19:49:37 INFO - mozscreenshot == 0.1 19:49:37 INFO - mozsystemmonitor == 0.0 19:49:37 INFO - moztest == 0.7 19:49:37 INFO - mozversion == 1.4 19:49:37 INFO - psutil == 3.1.1 19:49:37 INFO - requests == 1.2.3 19:49:37 INFO - wsgiref == 0.1.2 19:49:37 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:49: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')]} 19:49:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:49:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49: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')]} 19:49:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:49:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:49:37 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/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 0x7f0422fc3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21f36c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x22b46e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22eaa90>, '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 0x233cf70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x233d2e0>, 'level': 'critical'}], 'cwd': '/builds/slave/test-pgo/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', '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-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/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 19:49:37 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test-pgo/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test-pgo/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-pgo/build/tests/talos 19:49:37 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --download-cache /builds/slave/test-pgo/build/venv/cache --timeout 120 -r /builds/slave/test-pgo/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 19:49:37 INFO - Using env: {'DISPLAY': ':0', 19:49:37 INFO - 'HOME': '/home/cltbld', 19:49:37 INFO - 'LANG': 'en_US.UTF-8', 19:49:37 INFO - 'LANGUAGE': 'en_US:en', 19:49:37 INFO - 'LOGNAME': 'cltbld', 19:49:37 INFO - 'MAIL': '/var/mail/cltbld', 19:49:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:49:37 INFO - 'MOZ_NO_REMOTE': '1', 19:49:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:49:37 INFO - 'NO_EM_RESTART': '1', 19:49:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:49:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:49:37 INFO - 'PWD': '/builds/slave/test-pgo', 19:49:37 INFO - 'SHELL': '/bin/bash', 19:49:37 INFO - 'SHLVL': '1', 19:49:37 INFO - 'TERM': 'linux', 19:49:37 INFO - 'TMOUT': '86400', 19:49:37 INFO - 'USER': 'cltbld', 19:49:37 INFO - 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', 19:49:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:49:37 INFO - '_': '/tools/buildbot/bin/python'} 19:49:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 2)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 5)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 6)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 7)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 8)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 3)) 19:49:38 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 19:49:38 INFO - Cleaning up... 19:49:38 INFO - Return code: 0 19:49:38 INFO - Running post-action listener: _resource_record_post_action 19:49:38 INFO - Running post-action listener: _start_resource_monitoring 19:49:38 INFO - Starting resource monitoring. 19:49:38 INFO - ##### 19:49:38 INFO - ##### Running install step. 19:49:38 INFO - ##### 19:49:38 INFO - Running pre-action listener: _resource_record_pre_action 19:49:38 INFO - Running main action method: install 19:49:38 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 19:49:38 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 19:49:38 INFO - Reading from file tmpfile_stdout 19:49:38 INFO - Detecting whether we're running mozinstall >=1.0... 19:49:38 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 19:49:38 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 19:49:38 INFO - Reading from file tmpfile_stdout 19:49:38 INFO - Output received: 19:49:38 INFO - Usage: mozinstall [options] installer 19:49:38 INFO - Options: 19:49:38 INFO - -h, --help show this help message and exit 19:49:38 INFO - -d DEST, --destination=DEST 19:49:38 INFO - Directory to install application into. [default: 19:49:38 INFO - "/builds/slave/test-pgo"] 19:49:38 INFO - --app=APP Application being installed. [default: firefox] 19:49:38 INFO - mkdir: /builds/slave/test-pgo/build/application 19:49:38 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 19:49:38 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 19:49:52 INFO - Reading from file tmpfile_stdout 19:49:52 INFO - Output received: 19:49:52 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 19:49:52 INFO - Running post-action listener: _resource_record_post_action 19:49:52 INFO - ##### 19:49:52 INFO - ##### Running run-tests step. 19:49:52 INFO - ##### 19:49:52 INFO - Running pre-action listener: _resource_record_pre_action 19:49:52 INFO - Running main action method: run_tests 19:49:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 19:49:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 19:49:52 INFO - Python 2.7.3 19:49:52 INFO - Return code: 0 19:49:52 INFO - grabbing minidump binary from tooltool 19:49:52 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')]} 19:49:52 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-pgo/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 0x22eaa90>, '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 0x233cf70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x233d2e0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 19:49:52 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 19:49:52 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 19:49:52 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:49:52 INFO - Return code: 0 19:49:52 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 19:49:52 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 19:49:52 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 19:49:52 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 19:49:52 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 19:49:52 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-053', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 19:49:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-053 --webServer localhost 19:49:52 INFO - Using env: {'DISPLAY': ':0', 19:49:52 INFO - 'HOME': '/home/cltbld', 19:49:52 INFO - 'LANG': 'en_US.UTF-8', 19:49:52 INFO - 'LANGUAGE': 'en_US:en', 19:49:52 INFO - 'LOGNAME': 'cltbld', 19:49:52 INFO - 'MAIL': '/var/mail/cltbld', 19:49:52 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 19:49:52 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 19:49:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:49:52 INFO - 'MOZ_NO_REMOTE': '1', 19:49:52 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 19:49:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:49:52 INFO - 'NO_EM_RESTART': '1', 19:49:52 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:49:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:49:52 INFO - 'PWD': '/builds/slave/test-pgo', 19:49:52 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 19:49:52 INFO - 'SHELL': '/bin/bash', 19:49:52 INFO - 'SHLVL': '1', 19:49:52 INFO - 'TERM': 'linux', 19:49:52 INFO - 'TMOUT': '86400', 19:49:52 INFO - 'USER': 'cltbld', 19:49:52 INFO - 'XDG_SESSION_COOKIE': '919420d7ee4ef147bef0346300000385-1447297652.317436-549066302', 19:49:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:49:52 INFO - '_': '/tools/buildbot/bin/python'} 19:49:52 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-053', '--webServer', 'localhost'] with output_timeout 3600 19:49:53 INFO - mozversion INFO | application_buildid: 20151111173002 19:49:53 INFO - mozversion INFO | application_changeset: 5f9371f97e1e21f10fa20b39f33774116cfcf5f0 19:49:53 INFO - mozversion INFO | application_display_name: Nightly 19:49:53 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:49:53 INFO - mozversion INFO | application_name: Firefox 19:49:53 INFO - mozversion INFO | application_remotingname: firefox 19:49:53 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 19:49:53 INFO - mozversion INFO | application_vendor: Mozilla 19:49:53 INFO - mozversion INFO | application_version: 45.0a1 19:49:53 INFO - mozversion INFO | platform_buildid: 20151111173002 19:49:53 INFO - mozversion INFO | platform_changeset: 5f9371f97e1e21f10fa20b39f33774116cfcf5f0 19:49:53 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 19:49:53 INFO - mozversion INFO | platform_version: 45.0a1 19:49:53 INFO - 2015-11-11 19:49:53,109 DEBUG : using testdate: 1447300193 19:49:53 INFO - 2015-11-11 19:49:53,109 DEBUG : actual date: 1447300193 19:49:53 INFO - 2015-11-11 19:49:53,117 INFO : starting webserver on 'localhost:46498' 19:49:53 INFO - 2015-11-11 19:49:53,118 INFO : Starting test suite talos-linux64-ix-053 19:49:53 INFO - 2015-11-11 19:49:53,118 INFO : Starting test dromaeo_css 19:49:53 INFO - 2015-11-11 19:49:53,118 DEBUG : operating with platform_type : linux_ 19:49:53 INFO - 2015-11-11 19:49:53,119 INFO : Initialising browser for dromaeo_css test... 19:49:53 INFO - 2015-11-11 19:49:53,135 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpO1pyO2/profile http://localhost:46498/getInfo.html 19:49:56 INFO - 2015-11-11 19:49:56,760 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 19:49:56 INFO - 2015-11-11 19:49:56,760 DEBUG : BROWSER_OUTPUT: colorDepth:24 19:49:56 INFO - 2015-11-11 19:49:56,760 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 19:49:56 INFO - 2015-11-11 19:49:56,760 DEBUG : BROWSER_OUTPUT: __metrics 19:49:56 INFO - 2015-11-11 19:49:56,861 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:49:58 INFO - 2015-11-11 19:49:58,055 INFO : Browser initialized. 19:49:58 INFO - 2015-11-11 19:49:58,056 INFO : Running cycle 1/1 for dromaeo_css test... 19:49:58 INFO - 2015-11-11 19:49:58,056 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpO1pyO2/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 19:50:09 INFO - 2015-11-11 19:50:09,829 DEBUG : BROWSER_OUTPUT: RSS: Main: 141688832 19:50:09 INFO - 2015-11-11 19:50:09,829 DEBUG : BROWSER_OUTPUT: 19:51:01 INFO - 2015-11-11 19:51:01,310 DEBUG : BROWSER_OUTPUT: 1447300261306 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] 19:53:09 INFO - 2015-11-11 19:53:09,698 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46498/tests/dromaeo/cssquery-ext.html) 19:53:10 INFO - 2015-11-11 19:53:10,802 DEBUG : BROWSER_OUTPUT: RSS: Main: 236875776 19:53:10 INFO - 2015-11-11 19:53:10,802 DEBUG : BROWSER_OUTPUT: 19:56:13 INFO - 2015-11-11 19:56:13,059 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/dromaeo/cssquery-ext.html (next: http://localhost:46498/tests/dromaeo/cssquery-jquery.html) 19:56:13 INFO - 2015-11-11 19:56:13,626 DEBUG : BROWSER_OUTPUT: RSS: Main: 221540352 19:56:13 INFO - 2015-11-11 19:56:13,626 DEBUG : BROWSER_OUTPUT: 19:59:15 INFO - 2015-11-11 19:59:15,533 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46498/tests/dromaeo/cssquery-mootools.html) 19:59:16 INFO - 2015-11-11 19:59:16,094 DEBUG : BROWSER_OUTPUT: RSS: Main: 212475904 19:59:16 INFO - 2015-11-11 19:59:16,094 DEBUG : BROWSER_OUTPUT: 20:02:17 INFO - 2015-11-11 20:02:17,907 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46498/tests/dromaeo/cssquery-prototype.html) 20:02:18 INFO - 2015-11-11 20:02:18,493 DEBUG : BROWSER_OUTPUT: RSS: Main: 196509696 20:02:18 INFO - 2015-11-11 20:02:18,494 DEBUG : BROWSER_OUTPUT: 20:05:20 INFO - 2015-11-11 20:05:20,934 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46498/tests/dromaeo/cssquery-yui.html) 20:05:21 INFO - 2015-11-11 20:05:21,536 DEBUG : BROWSER_OUTPUT: RSS: Main: 199569408 20:05:21 INFO - 2015-11-11 20:05:21,536 DEBUG : BROWSER_OUTPUT: 20:08:23 INFO - 2015-11-11 20:08:23,857 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/dromaeo/cssquery-yui.html (next: http://localhost:46498/tests/dromaeo/cssquery-dojo.html) 20:08:24 INFO - 2015-11-11 20:08:24,107 DEBUG : BROWSER_OUTPUT: RSS: Main: 283385856 20:08:24 INFO - 2015-11-11 20:08:24,107 DEBUG : BROWSER_OUTPUT: 20:08:24 INFO - 2015-11-11 20:08:24,108 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:08:24 INFO - 2015-11-11 20:08:24,108 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:08:24 INFO - 2015-11-11 20:08:24,108 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:08:24 INFO - 2015-11-11 20:08:24,108 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:08:24 INFO - 2015-11-11 20:08:24,109 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3162.8576714047867;3217.2117831131377;3283.261266215102;3287.572615559977;3315.685009924058;5264.052470555299;5402.6758394496355;5433.347998240211;5485;5501.779928802848;5373.328333958255;5420.970015697015;5421.756020979055;5438.075527160382;5446.428125046872;4955.554000139978;4986.10250154972;5011.0228505441455;5017.799288028475;5038.470960549144;4899.387576552931;5092.388913330406;5094.083065048289;5155.974220128895;5183.559397451202;4914.97542512287;4958.107540642683;4978.82574109908;4993.575546078588;5020.171671674169;4931.432885218174;4947.925781113287;4948.777305021283;4968.677035992649;4974.825881094181;4819.6867203631655;4925.975370123162;4934.407871055496;4951.851444456672;4977.576905962997;5228.660137091115;5324.760385782649;5327.786888524493;5329;5332.413434522199;5949.6430214187285;5985.25184351956;6010.819675409744;6011.3086994995265;6012.729427175787;5788.652680839163;5834.824955251349;5937.109433584954;6021.096835474714;6041.516678665696;5590.692511911843;5613.887722245614;5619.943800561983;5620.044592419298;5621.325440947072;6070.484008859208;6077.1491991121275;6078.544109191828;6079.726412311456;6096.481799047042;5543.695096769636;5633.521150702154;5780.797672081457;5910.113482977587;5911.261092363455;5943.702814859326;5956.374580669054;5957.553183511254;5959.851003724855;5965.075413310944;5919.6152250103605;5920.467157955804;5930.9406905931255;5934.643921364732;5936.762529498858;5718.399568045378;5836.562257830679;5852.297724273029;5904.5571582131515;5946.494547963472;4491.966847624999;4508.954910450919;4523.864284071483;4535.818567257339;4558.49856515783;3926.528816541976;4029.6574791142493;4042.130941847458;4049.676025917978;4079.224947260011;5503.229547863302;5516.586256030814;5568.44315568448;5591.4688104629995;5637.9718101409235;5852.882942341129;5867.647941123546;5876.382979787147;5884.08796636522;5895.734691938873;5330.840074797762;5487.780488780404;5534.4742249486235;5540;5554.055810512223;5050.595952323805;5103.209002604603;5103.362079740033;5117.462666419972;5136.666116702402;6134.294556126013;6161.383861613893;6161.537884658579;6164.506839452833;6179.16581261533;5783.971080144573;5887.941120588739;5925.229720136354;5928;5942.286925568959;5958.672273025025;6021.969890150521;6023.247094113236;6023.939760602338;6041.758329666764;5836.854078648068;5839.532837373085;5842.1820945068575;5851.561132915133;5867.647941123546;5732.484076433141;5839.737211825393;5856.970715146397;5909.025010873158;5922.170896074639;5678.318601767649;5688.260526131577;5691.26013618227;5700.629459085146;5775.220345253337;5663.093904975184;5666.291713535808;5668.03643380618;5671.319441667027;5677.460641239076;5456.508914197741;5566.554675626021;5567.7494512747835;5570.470805273492;5695.373508913934;5760.827175184583;5801.448862358069;5827.329857066492;5854.531637468907;5876.941230587639;5688.7440065198;5694.572907031907;5711.914321285101;5729.4843464088435;5734.741936612946 20:08:24 INFO - 2015-11-11 20:08:24,110 DEBUG : BROWSER_OUTPUT: |1;ext.html;558.8044184535413;582.7843697831803;593.190295246988;600.2287061126452;602.6745557399004;32277.354452910928;33085.172870678216;37011.25977480449;37318.81340593293;37385.06537336568;40903;41274;41302.793486032606;41454;41739.58260417395;7715.382769378464;7944.324732397753;8825.823483530325;9028.232600228988;9037.231835293975;10651.78696426071;10887.074598659085;10887.945560272188;10888.945555272252;10892.509837057352;10608.15134789215;10648.254622176451;10712.571497140105;10721.80203058375;10750.78498430031;7844.843103137934;8026;10397.220208484356;10626;10874.510647020903;10447.52986115619;10562.26064175508;10598.947005264925;10605.681829545127;10605.787884242349;41076.79461602703;41438.79280603577;41467.585324146676;41577.168456631;41594.58405415937;3197.904062878094;3226.887058952949;3235.4499735045097;3261.3803377358463;3288.983555082233;30672;30677.846610766803;31026;31176;31936;3457.3360566340734;3465.3935561276926;3468.3410152071024;3473.9652603473896;3509.31568344173;277551;278623;278945;279584;279979;58441;59722;60387;60894.69552652297;61017.38982610206;56505.43494565084;56838;56843.431565683815;56911.43088569144;56944.715276424184;12407.875921240853;12411.255324680547;12519.56181533642;12546;12695.174813637084;9173.266138708887;9198.494082825375;9207.033261507579;9209.217216536535;9213.493257870881;20558;20739;20740.896295518425;20797.272095476586;20806.479838003866;7604.163542010375;7655.846883062308;7730.613469326511;7744.845103097907;7817;935.854942483916;998.276249718948;1007.8488226766044;1061.3631820907394;1064.297563608015;28063.298417539725;28817;28962.565561516592;29251.707482925325;29262;948.9762755931018;977.5894124467741;1031.4791030529684;1056.054830926332;1060.4008735064663;14382.424703011762;14854.702905942037;14920.477783277533;15135.621609459851;15140.621484462756;329887;336562;336836;337089;337146;51859.48140518622;52206.474190726156;52212;52268.21597676038;52279;1340.7117469744053;1362.3801170467414;1363.6522686715023;1370.8080868678394;1456.5047883719585;23598.938047787546;30927;31167.844160779958;31207;31524.68475315309;49342.25986610132;49833.252501211784;49870;49906.50093499019;49942.25086623631;279771;282409;282473;282531;283354;29547.556786647787;30018.24954376158;31665.683343166274;32237;32502;39111;39170;39401.46883108479;39534.604653953094;40100.1979960405;33140;33565.66434335626;33977.150571235914;34049.31901362009;36510.63489365072;28582.857085714437;31958.201044974063;34869.476957845145;36013;36505;34366.5908448922;35428.64571354254;35633.82183089068;35898.10254743652;35905.28189436145;31759;32223.35553288968;32509.553886904483;32547.14151452761;32699;24617.261482155565;24861.254162375157;24863.50272994494;25010.624840627042;25164.49671006606 20:08:24 INFO - 2015-11-11 20:08:24,112 DEBUG : BROWSER_OUTPUT: |2;jquery.html;354.6949623323941;355.58929436500836;355.93237284915847;357.47808200027947;359.07179939855473;14531;14540.491082812103;16928.238229279683;17514;18450.44648660539;15156.166410847427;15525.456609018658;15601.375944962188;15602.843971560282;16333.5916602085;5164.586833053366;5285.445028272034;5288.629795914288;5295.179247216687;5326.946730532683;3903.2583809076327;4023.4970628671417;5258.92111618326;5287.154055351145;5853.970730146343;5874.970625146868;5928.644281343133;5939.376365481606;5957.6723280219785;5964.165016897616;5795.333536643277;5894.17481552583;5894.911576326359;5905.586608937398;6031.487323577501;5159.1229490986625;5159.509846564571;5176.818811341623;5181.145111056671;5183.533481986639;20285;20759.169633214653;20760.792392076037;21047.158113675436;21392.679109813365;2037.7350944377283;2105.0632468551503;2254.211026140854;2461.729209786922;2466.8643224622638;13240.404181811842;13248.40382182804;13249.867501325056;13606.38771255296;13848.792268115987;1824.2247045005952;1831.2583403721515;1855.5824939388665;1865.6268746250805;1871.5563363411252;60915.08627370637;61496;62756;63129.36870631281;63770.68114659397;9633.518324083769;9805.607775688892;10005.649802256887;10009.498575213776;10076.294659373774;12839.972802175804;12849.678758030937;12888;12900.29048402347;12910.870891290966;6839.350261725128;6918.308169183041;6953.235144134142;7002.579845209304;7015.89476157858;6512.902306465407;6567.9671601641685;6578.440832529192;6594.021793461942;6603.8349041273395;5894.469497745138;5971.5222782177325;6016;6025.969870150709;6032.849178770566;1625.3336132185748;1702.821203773586;1733.2027267456858;1744.398182627017;1777.2091419318278;833.6457005772522;890.6927110147119;926.0322962504199;1001.7445551384351;1008.4251976373544;10815.891841081646;11807.933611617933;12466.688332791753;12512.74974500523;17714.291428342978;491.35877679627714;491.70251997541686;501.2581379558274;505.89376230991166;520.4821202903136;4650.465196502378;6505.186851643544;6546.738130474728;6607.702653380609;6634.0712300278;539495;545042;545885;558558;559625;78034.6098269505;82176.17823821805;82900;82990.58504707438;83921;552.6711606594071;566.8639526513607;572.241779641976;572.8682403047239;573.4323020210046;11115.610953616584;11462.541498340306;11565.306081635128;11575.76848463043;11656.417179141179;36737.81631091934;36996.44505332368;37686.81156594309;40082.59917400789;40484.59515404926;46743.76628116838;47199.29201061918;49181.50818491769;53219;53862.730686346316;14021.158730476203;14995.925020374829;15033;15178;15393;17916.731249031534;18132.909335453238;18333.54166145857;18849.434516964513;19640;15540.145292008596;15713.607159821097;16067.598310042342;16467.505974820775;16480.17599120015;15220.391184352502;15415.61460963485;15568.455104071303;16077.67844643124;16229.59426014359;12767.629344858151;14014.719705606034;15467.303971321093;15951.920240398724;16255.51233462998;14173.574792756233;14440.638984025483;14497.347619356944;14509.419623214953;14661.413543458142;15076.246187690791;15112.546623601309;15215.08709477435;15689;15730.606734831721 20:08:24 INFO - 2015-11-11 20:08:24,113 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1520.0423733048192;1656.1139790212235;1712.9082006977405;1756.3677076252548;1789.9194536245868;6951;7478.700851965922;7691.615419229037;7703.653335599897;7706.152323244439;7538.924610753891;7792.532448053121;7794.727184548542;7800.7269745558915;7806.687732490708;1985.7418535590352;2040.9081591328352;2210.5247371815058;2266.8073213776806;2292.8280378971563;2259.378670865517;2261.9321420357332;2264.275431861805;2265.1958554713087;2267.7845604667614;2207.2054060538194;2308.480591866825;2308.6883270758485;2309.3302942146756;2311.8959646815933;1964.1357802566897;1998.2007197121195;2184.1263494602126;2237.7538470768204;2242.024719247133;2161.232762369352;2164;2197.1540956731615;2198.505336299336;2212.7565967743535;7618.733344332977;7642;7689.19263477338;7701.653425595806;7707.807304817368;4482.9551704482865;4551.044280701057;4561.475430325489;4601.953980460186;4602.010567727954;2992.147238037149;3042.574039634453;3067.8926237581577;3072.201227680797;3116.1897906544464;967.8741763570761;978.280963491833;980.6567701304558;1007.3754272351116;1017.6387382479187;10450.895491045145;10459.895401045967;10480.318779279398;10488.475576221159;10491.790164196673;4174.123434078878;4245.3844192591905;4292.399064131024;4303.117860838521;4306.310990241546;9129.908700913038;9139.588718507683;9149.405288656217;9153.496557689392;9160.129787670161;4663.020765639186;4664.510226426177;4668.229742092517;4672.486026537078;4677.368555245066;4181.811818468176;4208.894777630522;4214.325707886785;4216.451861258017;4227.260229459832;3612.2956023575152;3617.113807117273;3659.908502287464;3672.265546890633;3701.759385639925;1133.6145710458484;1152.9711757206137;1166.4078532802664;1179.775842589905;1184.2420850655587;1313.5862203405898;1319.9736005280033;1336.1248382309602;1351.3648585164956;1353.6683512539294;6994.510384273154;7098.751543695946;7139.250378710264;7145.214026457085;7157.713691452388;457.7047804166361;458.84857996860956;477.32935226007515;485.0178388762713;485.9125357435625;5709.885802283931;5766.798162064308;5768.278965129359;5780.104083867007;5789.218455508537;8814.515201663842;9044.095590441035;9280.62877484893;9281.535923203814;9328;9243.214326782165;9245.491497967541;9251;9251.398659087137;9255.074492550692;7234.6382680865745;7294.70821167158;7364.079490063742;7369.410447164321;7444.627768611656;7382.926170738224;7438.256174382518;7440.7023719052795;7445.702171913063;7454.552726836408;8213.260806527442;8219.178082191733;8343.749687509384;8360.205780450848;8500.957495212484;8490.65008859884;8593.484390936565;8595;8595.613197406006;8603.354748393771;6943.930560694328;7080.610566418896;7091.787246382617;7092.645367731489;7095.290470952863;7572.697092116254;7614.314711675976;7614.733484328243;7626.8855967159425;7634.274743899321;6390.456811171102;6979.476539259677;7171.354578087997;7223.927760722536;7322.340989310775;6389.584676995981;6482.060101285381;6916.792496225121;6966.477514186355;7007;6588.209414870246;6752.426043786333;6836.829079273058;6840.31596840312;6842.315768423118;6453.45145662624;6493.415592596689;6502.642354670538;6504.804855854332;6508.642024688687;6579.934200658124;6608.273089960005;6610;6611.140551728245;6615.536912416084 20:08:24 INFO - 2015-11-11 20:08:24,115 DEBUG : BROWSER_OUTPUT: |4;prototype.html;329.9307145499445;331.17041810265283;332.44149828288465;334.9112485191425;336.73566250493354;5655.5475561955045;5818.41815818419;5847.44449277319;5868.4131586841295;5883.176355310255;5609.691466969325;5677.545796336293;5692.060809966361;5731;5756.222909907161;4371.759553224571;4408.559144085598;4435.046465010022;4440.533743956887;4444.622207112399;4281.079567892903;4354.912901741964;4368.759718215497;4418.911621767563;4439.733615983051;4386.451693538308;4390.912181756379;4399.05420334628;4412.139632771611;4413.735175889441;4393.978030109861;4401.515833258339;4407.3388991651345;4407.537208593099;4409.294512877924;3862.8261728222296;3873.438351439054;3879.2241551689776;3879.670228030621;3883.1262965832743;5360.035193665139;5467.0705979983495;5473.17902314652;5499.50504454597;5523.28197334344;5112.46319136489;5116.053530096944;5118.053160165381;5120.6927584344685;5122.590192784568;6014.188084608566;6036.547258955596;6039.275286965549;6046.879062418771;6075.392460753934;4089.3661482470266;4145.585441455861;4174.415581818548;4205;4208.137331846964;6242.282137554194;6262.060690896356;6265.436110750009;6272.15325930998;6284.4344009039405;4283.186194623074;4285.3786201000685;4285.721428107163;4287.614114729627;4289.935650965238;4251.702380833374;4330.848420305274;4336.501302350207;4337.9783101084295;4338.501072376654;5075.619328550373;5077.898442031139;5081.3140226069745;5084.872878178076;5086.5422112009355;6149.0776383542825;6155.84610384744;6157.907631385533;6181.8454538636;6190.0405437157315;1590.6421055262704;1612.9596760080858;1614.088040257251;1615.240836806699;1615.6041769766482;1080.1790639114329;1085.159001773616;1088.2871719024051;1099.1756182862853;1105.972350691223;5956.047032474783;5959.046552551571;5961.5230781537375;5963.344032156459;5966.463018328372;6290.55966082379;6305.211848518935;6308.3060863305;6313.96843015782;6316;5914.585978981516;5919.6152250103605;5965.492933100648;5972.283326000821;5975.970120149372;3451.516787649731;3535.6287589803214;3541.2740388220354;3541.8937431877084;3541.8937431877084;6624.337566243434;6632.900506492407;6635.4359879410795;6636.402723754885;6641.402273795382;6518.511111666644;6523.282438931714;6526.6946610677105;6533.346665333524;6535.0850880876715;6477.4494167996245;6578.934210657928;6620.304867988888;6631.602103873783;6632.701528431136;6342.23893132827;6375.776847810304;6379.744810207725;6385.521085918482;6387.105805187371;6127.050307202391;6155;6221.253449586078;6278.686065696788;6288.496920246461;6472.644004579794;6512.804615861532;6528.445082168069;6530.67346632676;6544.6727663615675;4325.091730736581;4354.346847972829;4359.60763531271;4362.127574485179;4364.716293440916;6157.753689852356;6295.307516173126;6311.526635502264;6316.368363163647;6317.147185129948;6187.041008643668;6196.194494715658;6213.875722485434;6223.190985171898;6225.595336303126;6201.565890387629;6208.192934918612;6210;6216.316205217332;6219.968900155471;5990.281166259902;6118.326984031664;6119.694015299307;6122.5408094392205;6134.35589263121;6237.594556353823;6253.843653908507;6254.3745625437095;6256.468200203034;6256.906146407899;6057.757689692363;6111.663858487826;6125.234345706786;6126.724297406538;6129.387061293835 20:08:24 INFO - 2015-11-11 20:08:24,116 DEBUG : BROWSER_OUTPUT: |5;yui.html;795.3319211862034;802.1697543042952;811.9837603247931;824.6701319472212;835.8704400817874;12996.41516131774;13232.603021909346;13288.46846126155;14408.711825763505;14438.855611443882;13459.5289164879;13555.457781688721;13574.592762217124;13577.117487363315;13582.932085339584;685.0170006041346;689.6276010954078;811.111832543364;830;831.3972370031709;815.1440986963694;822.8847961285425;829.7178959153887;830.3730683334104;830.3979614779297;868.1405408645427;875.7285241575132;876.2464280718609;876.5792419638577;876.8684697295392;700.6076597105612;708.3837061756279;837.2966707965338;851.6380538271272;858.8840506531601;623.1867413025999;624.8843963866699;628.1269036039909;628.3276893723718;629.3832044596276;12953.352332383343;13181.143225690299;13182.670433239246;13190.802137967938;13206.801897971538;11679.883201167964;12428.120573544376;13037.543685970946;13134.802977955338;13555.25446100464;10069.546870390777;10097.646582369582;10129.645462408855;10319.461853847537;10324.638637647722;3387.9830600847085;3410.8635654573786;3478.6521347865264;3506.8772592959126;3511.91220219494;48009;48467.27299090516;48495.27257091147;48772.26841597379;48857.75571122157;9690;9777.951110244403;9873.901260987299;9999.150072243796;10036.197104231644;19380.70928936067;19384.515387115436;19416.805831941783;19453.51366215856;19462.61074778525;7433.591152486557;7555.584442855696;7609.353204977639;7699.807504812425;7955.403344749051;4339.370791235317;4369.956300436955;4376.102898905717;4463.285874260103;4473.038296766211;3052.374263276023;3104.363605460875;3106.192389978622;3106.8601912913973;3111.175538482304;427.40377173842313;437.07994671217267;445.7080612199015;449.80883124671885;450.2975358440843;564.4750382144645;658.4443510714513;660.6960798032862;670.6479098473243;674.0563211503836;8434.873476897852;8465.238128568459;8481.109483504266;8490.278326342206;8670.560422750741;523.1472699499867;541.8509909774843;596.5615272774508;663.3068443476578;677.2482544375739;3967.484227050523;4212.726172798758;4224.894377640522;4326.156399502067;4364.4568923285615;57443.71278143666;57613.711931440914;57712.71143644255;57880;57935.42064579385;47207.763961179975;47384;47697.28454073192;47734.28398574024;47826.28260576094;46295.30557041647;46589.534104658516;46600.30099548509;47716.7614161927;48494.272585910534;8334.249917507454;8405.579721014046;8527.147285271423;8529.019162796358;8760.342974276828;33911.491327630596;34366.82816585901;35371;35509.28981420409;36050.63949360578;40678.593214068664;42018;42565.5743442574;42781.57218427776;43260.567394325655;8235.547044912588;8307;8572.314214862921;8675.132486751274;8786.824263514822;12019;12257.509699611915;12386;12847.871521285042;12951.870481295067;11182.32906025641;11268.549258029587;11496.310221386744;11746.823797642872;11865.762684746429;11432.599859005228;11529.48189359674;11770.470328835394;11794.587189448328;12369;11308.7738245233;11642.592509262135;11726.179167458537;11832.46753896094;11977.820332695192;9859;9872.141505976759;10063.144632706302;10099.848502272325;10182.338148020355;9284.628614855601;9293.442393456415;9796.216302695624;9962.302638815214;10115 20:08:24 INFO - 2015-11-11 20:08:24,116 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:08:24 INFO - 2015-11-11 20:08:24,116 DEBUG : BROWSER_OUTPUT: __start_cc_report 20:08:24 INFO - 2015-11-11 20:08:24,116 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,843 20:08:24 INFO - 2015-11-11 20:08:24,116 DEBUG : BROWSER_OUTPUT: __end_cc_report 20:08:24 INFO - 2015-11-11 20:08:24,116 DEBUG : BROWSER_OUTPUT: __startTimestamp1447301304107__endTimestamp 20:08:24 INFO - 2015-11-11 20:08:24,116 DEBUG : BROWSER_OUTPUT: 20:08:24 INFO - 2015-11-11 20:08:24,118 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:08:24 INFO - 2015-11-11 20:08:24,118 DEBUG : BROWSER_OUTPUT: Number of tests: 6 20:08:24 INFO - 2015-11-11 20:08:24,118 DEBUG : BROWSER_OUTPUT: 20:08:24 INFO - 2015-11-11 20:08:24,118 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5462.75 Median:5666.29 stddev:619.57 (10.9%) stddev-sans-first:594.62 20:08:24 INFO - 2015-11-11 20:08:24,118 DEBUG : BROWSER_OUTPUT: Values: 3162.9 3217.2 3283.3 3287.6 3315.7 5264.1 5402.7 5433.3 5485.0 5501.8 5373.3 5421.0 5421.8 5438.1 5446.4 4955.6 4986.1 5011.0 5017.8 5038.5 4899.4 5092.4 5094.1 5156.0 5183.6 4915.0 4958.1 4978.8 4993.6 5020.2 4931.4 4947.9 4948.8 4968.7 4974.8 4819.7 4926.0 4934.4 4951.9 4977.6 5228.7 5324.8 5327.8 5329.0 5332.4 5949.6 5985.3 6010.8 6011.3 6012.7 5788.7 5834.8 5937.1 6021.1 6041.5 5590.7 5613.9 5619.9 5620.0 5621.3 6070.5 6077.1 6078.5 6079.7 6096.5 5543.7 5633.5 5780.8 5910.1 5911.3 5943.7 5956.4 5957.6 5959.9 5965.1 5919.6 5920.5 5930.9 5934.6 5936.8 5718.4 5836.6 5852.3 5904.6 5946.5 4492.0 4509.0 4523.9 4535.8 4558.5 3926.5 4029.7 4042.1 4049.7 4079.2 5503.2 5516.6 5568.4 5591.5 5638.0 5852.9 5867.6 5876.4 5884.1 5895.7 5330.8 5487.8 5534.5 5540.0 5554.1 5050.6 5103.2 5103.4 5117.5 5136.7 6134.3 6161.4 6161.5 6164.5 6179.2 5784.0 5887.9 5925.2 5928.0 5942.3 5958.7 6022.0 6023.2 6023.9 6041.8 5836.9 5839.5 5842.2 5851.6 5867.6 5732.5 5839.7 5857.0 5909.0 5922.2 5678.3 5688.3 5691.3 5700.6 5775.2 5663.1 5666.3 5668.0 5671.3 5677.5 5456.5 5566.6 5567.7 5570.5 5695.4 5760.8 5801.4 5827.3 5854.5 5876.9 5688.7 5694.6 5711.9 5729.5 5734.7 20:08:24 INFO - 2015-11-11 20:08:24,118 DEBUG : BROWSER_OUTPUT: 20:08:24 INFO - 2015-11-11 20:08:24,118 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:46675.80 Median:17993.99 stddev:78427.60 (435.9%) stddev-sans-first:78571.17 20:08:24 INFO - 2015-11-11 20:08:24,119 DEBUG : BROWSER_OUTPUT: Values: 558.8 582.8 593.2 600.2 602.7 32277.4 33085.2 37011.3 37318.8 37385.1 40903.0 41274.0 41302.8 41454.0 41739.6 7715.4 7944.3 8825.8 9028.2 9037.2 10651.8 10887.1 10887.9 10888.9 10892.5 10608.2 10648.3 10712.6 10721.8 10750.8 7844.8 8026.0 10397.2 10626.0 10874.5 10447.5 10562.3 10598.9 10605.7 10605.8 41076.8 41438.8 41467.6 41577.2 41594.6 3197.9 3226.9 3235.4 3261.4 3289.0 30672.0 30677.8 31026.0 31176.0 31936.0 3457.3 3465.4 3468.3 3474.0 3509.3 277551.0 278623.0 278945.0 279584.0 279979.0 58441.0 59722.0 60387.0 60894.7 61017.4 56505.4 56838.0 56843.4 56911.4 56944.7 12407.9 12411.3 12519.6 12546.0 12695.2 9173.3 9198.5 9207.0 9209.2 9213.5 20558.0 20739.0 20740.9 20797.3 20806.5 7604.2 7655.8 7730.6 7744.8 7817.0 935.9 998.3 1007.8 1061.4 1064.3 28063.3 28817.0 28962.6 29251.7 29262.0 949.0 977.6 1031.5 1056.1 1060.4 14382.4 14854.7 14920.5 15135.6 15140.6 329887.0 336562.0 336836.0 337089.0 337146.0 51859.5 52206.5 52212.0 52268.2 52279.0 1340.7 1362.4 1363.7 1370.8 1456.5 23598.9 30927.0 31167.8 31207.0 31524.7 49342.3 49833.3 49870.0 49906.5 49942.3 279771.0 282409.0 282473.0 282531.0 283354.0 29547.6 30018.2 31665.7 32237.0 32502.0 39111.0 39170.0 39401.5 39534.6 40100.2 33140.0 33565.7 33977.2 34049.3 36510.6 28582.9 31958.2 34869.5 36013.0 36505.0 34366.6 35428.6 35633.8 35898.1 35905.3 31759.0 32223.4 32509.6 32547.1 32699.0 24617.3 24861.3 24863.5 25010.6 25164.5 20:08:24 INFO - 2015-11-11 20:08:24,119 DEBUG : BROWSER_OUTPUT: 20:08:24 INFO - 2015-11-11 20:08:24,119 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:29645.09 Median:355.14 stddev:89848.98 (25299.4%) stddev-sans-first:90074.11 20:08:24 INFO - 2015-11-11 20:08:24,119 DEBUG : BROWSER_OUTPUT: Values: 354.7 355.6 355.9 357.5 359.1 14531.0 14540.5 16928.2 17514.0 18450.4 15156.2 15525.5 15601.4 15602.8 16333.6 5164.6 5285.4 5288.6 5295.2 5326.9 3903.3 4023.5 5258.9 5287.2 5854.0 5875.0 5928.6 5939.4 5957.7 5964.2 5795.3 5894.2 5894.9 5905.6 6031.5 5159.1 5159.5 5176.8 5181.1 5183.5 20285.0 20759.2 20760.8 21047.2 21392.7 2037.7 2105.1 2254.2 2461.7 2466.9 13240.4 13248.4 13249.9 13606.4 13848.8 1824.2 1831.3 1855.6 1865.6 1871.6 60915.1 61496.0 62756.0 63129.4 63770.7 9633.5 9805.6 10005.6 10009.5 10076.3 12840.0 12849.7 12888.0 12900.3 12910.9 6839.4 6918.3 6953.2 7002.6 7015.9 6512.9 6568.0 6578.4 6594.0 6603.8 5894.5 5971.5 6016.0 6026.0 6032.8 1625.3 1702.8 1733.2 1744.4 1777.2 833.6 890.7 926.0 1001.7 1008.4 10815.9 11807.9 12466.7 12512.7 17714.3 491.4 491.7 501.3 505.9 520.5 4650.5 6505.2 6546.7 6607.7 6634.1 539495.0 545042.0 545885.0 558558.0 559625.0 78034.6 82176.2 82900.0 82990.6 83921.0 552.7 566.9 572.2 572.9 573.4 11115.6 11462.5 11565.3 11575.8 11656.4 36737.8 36996.4 37686.8 40082.6 40484.6 46743.8 47199.3 49181.5 53219.0 53862.7 14021.2 14995.9 15033.0 15178.0 15393.0 17916.7 18132.9 18333.5 18849.4 19640.0 15540.1 15713.6 16067.6 16467.5 16480.2 15220.4 15415.6 15568.5 16077.7 16229.6 12767.6 14014.7 15467.3 15951.9 16255.5 14173.6 14440.6 14497.3 14509.4 14661.4 15076.2 15112.5 15215.1 15689.0 15730.6 20:08:24 INFO - 2015-11-11 20:08:24,119 DEBUG : BROWSER_OUTPUT: 20:08:24 INFO - 2015-11-11 20:08:24,120 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5413.65 Median:6487.74 stddev:2826.04 (43.6%) stddev-sans-first:2818.82 20:08:24 INFO - 2015-11-11 20:08:24,121 DEBUG : BROWSER_OUTPUT: Values: 1520.0 1656.1 1712.9 1756.4 1789.9 6951.0 7478.7 7691.6 7703.7 7706.2 7538.9 7792.5 7794.7 7800.7 7806.7 1985.7 2040.9 2210.5 2266.8 2292.8 2259.4 2261.9 2264.3 2265.2 2267.8 2207.2 2308.5 2308.7 2309.3 2311.9 1964.1 1998.2 2184.1 2237.8 2242.0 2161.2 2164.0 2197.2 2198.5 2212.8 7618.7 7642.0 7689.2 7701.7 7707.8 4483.0 4551.0 4561.5 4602.0 4602.0 2992.1 3042.6 3067.9 3072.2 3116.2 967.9 978.3 980.7 1007.4 1017.6 10450.9 10459.9 10480.3 10488.5 10491.8 4174.1 4245.4 4292.4 4303.1 4306.3 9129.9 9139.6 9149.4 9153.5 9160.1 4663.0 4664.5 4668.2 4672.5 4677.4 4181.8 4208.9 4214.3 4216.5 4227.3 3612.3 3617.1 3659.9 3672.3 3701.8 1133.6 1153.0 1166.4 1179.8 1184.2 1313.6 1320.0 1336.1 1351.4 1353.7 6994.5 7098.8 7139.3 7145.2 7157.7 457.7 458.8 477.3 485.0 485.9 5709.9 5766.8 5768.3 5780.1 5789.2 8814.5 9044.1 9280.6 9281.5 9328.0 9243.2 9245.5 9251.0 9251.4 9255.1 7234.6 7294.7 7364.1 7369.4 7444.6 7382.9 7438.3 7440.7 7445.7 7454.6 8213.3 8219.2 8343.7 8360.2 8501.0 8490.7 8593.5 8595.0 8595.6 8603.4 6943.9 7080.6 7091.8 7092.6 7095.3 7572.7 7614.3 7614.7 7626.9 7634.3 6390.5 6979.5 7171.4 7223.9 7322.3 6389.6 6482.1 6916.8 6966.5 7007.0 6588.2 6752.4 6836.8 6840.3 6842.3 6453.5 6493.4 6502.6 6504.8 6508.6 6579.9 6608.3 6610.0 6611.1 6615.5 20:08:24 INFO - 2015-11-11 20:08:24,121 DEBUG : BROWSER_OUTPUT: 20:08:24 INFO - 2015-11-11 20:08:24,121 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5139.77 Median:5917.10 stddev:1546.22 (26.1%) stddev-sans-first:1507.83 20:08:24 INFO - 2015-11-11 20:08:24,123 DEBUG : BROWSER_OUTPUT: Values: 329.9 331.2 332.4 334.9 336.7 5655.5 5818.4 5847.4 5868.4 5883.2 5609.7 5677.5 5692.1 5731.0 5756.2 4371.8 4408.6 4435.0 4440.5 4444.6 4281.1 4354.9 4368.8 4418.9 4439.7 4386.5 4390.9 4399.1 4412.1 4413.7 4394.0 4401.5 4407.3 4407.5 4409.3 3862.8 3873.4 3879.2 3879.7 3883.1 5360.0 5467.1 5473.2 5499.5 5523.3 5112.5 5116.1 5118.1 5120.7 5122.6 6014.2 6036.5 6039.3 6046.9 6075.4 4089.4 4145.6 4174.4 4205.0 4208.1 6242.3 6262.1 6265.4 6272.2 6284.4 4283.2 4285.4 4285.7 4287.6 4289.9 4251.7 4330.8 4336.5 4338.0 4338.5 5075.6 5077.9 5081.3 5084.9 5086.5 6149.1 6155.8 6157.9 6181.8 6190.0 1590.6 1613.0 1614.1 1615.2 1615.6 1080.2 1085.2 1088.3 1099.2 1106.0 5956.0 5959.0 5961.5 5963.3 5966.5 6290.6 6305.2 6308.3 6314.0 6316.0 5914.6 5919.6 5965.5 5972.3 5976.0 3451.5 3535.6 3541.3 3541.9 3541.9 6624.3 6632.9 6635.4 6636.4 6641.4 6518.5 6523.3 6526.7 6533.3 6535.1 6477.4 6578.9 6620.3 6631.6 6632.7 6342.2 6375.8 6379.7 6385.5 6387.1 6127.1 6155.0 6221.3 6278.7 6288.5 6472.6 6512.8 6528.4 6530.7 6544.7 4325.1 4354.3 4359.6 4362.1 4364.7 6157.8 6295.3 6311.5 6316.4 6317.1 6187.0 6196.2 6213.9 6223.2 6225.6 6201.6 6208.2 6210.0 6216.3 6220.0 5990.3 6118.3 6119.7 6122.5 6134.4 6237.6 6253.8 6254.4 6256.5 6256.9 6057.8 6111.7 6125.2 6126.7 6129.4 20:08:24 INFO - 2015-11-11 20:08:24,123 DEBUG : BROWSER_OUTPUT: 20:08:24 INFO - 2015-11-11 20:08:24,123 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13689.09 Median:46442.42 stddev:15700.15 (33.8%) stddev-sans-first:15714.33 20:08:24 INFO - 2015-11-11 20:08:24,127 DEBUG : BROWSER_OUTPUT: Values: 795.3 802.2 812.0 824.7 835.9 12996.4 13232.6 13288.5 14408.7 14438.9 13459.5 13555.5 13574.6 13577.1 13582.9 685.0 689.6 811.1 830.0 831.4 815.1 822.9 829.7 830.4 830.4 868.1 875.7 876.2 876.6 876.9 700.6 708.4 837.3 851.6 858.9 623.2 624.9 628.1 628.3 629.4 12953.4 13181.1 13182.7 13190.8 13206.8 11679.9 12428.1 13037.5 13134.8 13555.3 10069.5 10097.6 10129.6 10319.5 10324.6 3388.0 3410.9 3478.7 3506.9 3511.9 48009.0 48467.3 48495.3 48772.3 48857.8 9690.0 9778.0 9873.9 9999.2 10036.2 19380.7 19384.5 19416.8 19453.5 19462.6 7433.6 7555.6 7609.4 7699.8 7955.4 4339.4 4370.0 4376.1 4463.3 4473.0 3052.4 3104.4 3106.2 3106.9 3111.2 427.4 437.1 445.7 449.8 450.3 564.5 658.4 660.7 670.6 674.1 8434.9 8465.2 8481.1 8490.3 8670.6 523.1 541.9 596.6 663.3 677.2 3967.5 4212.7 4224.9 4326.2 4364.5 57443.7 57613.7 57712.7 57880.0 57935.4 47207.8 47384.0 47697.3 47734.3 47826.3 46295.3 46589.5 46600.3 47716.8 48494.3 8334.2 8405.6 8527.1 8529.0 8760.3 33911.5 34366.8 35371.0 35509.3 36050.6 40678.6 42018.0 42565.6 42781.6 43260.6 8235.5 8307.0 8572.3 8675.1 8786.8 12019.0 12257.5 12386.0 12847.9 12951.9 11182.3 11268.5 11496.3 11746.8 11865.8 11432.6 11529.5 11770.5 11794.6 12369.0 11308.8 11642.6 11726.2 11832.5 11977.8 9859.0 9872.1 10063.1 10099.8 10182.3 9284.6 9293.4 9796.2 9962.3 10115.0 20:08:24 INFO - 2015-11-11 20:08:24,127 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:08:24 INFO - 2015-11-11 20:08:24,127 DEBUG : BROWSER_OUTPUT: 20:08:24 INFO - 2015-11-11 20:08:24,811 INFO : Browser exited with error code: 0 20:08:24 INFO - 2015-11-11 20:08:24,830 INFO : Completed test dromaeo_css (00:18:31) 20:08:24 INFO - 2015-11-11 20:08:24,830 INFO : Starting test kraken 20:08:24 INFO - 2015-11-11 20:08:24,830 DEBUG : operating with platform_type : linux_ 20:08:24 INFO - 2015-11-11 20:08:24,830 INFO : Initialising browser for kraken test... 20:08:24 INFO - 2015-11-11 20:08:24,836 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpEarvvx/profile http://localhost:46498/getInfo.html 20:08:28 INFO - 2015-11-11 20:08:28,286 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 20:08:28 INFO - 2015-11-11 20:08:28,286 DEBUG : BROWSER_OUTPUT: colorDepth:24 20:08:28 INFO - 2015-11-11 20:08:28,286 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 20:08:28 INFO - 2015-11-11 20:08:28,286 DEBUG : BROWSER_OUTPUT: __metrics 20:08:28 INFO - 2015-11-11 20:08:28,415 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 20:08:29 INFO - 2015-11-11 20:08:29,507 INFO : Browser initialized. 20:08:29 INFO - 2015-11-11 20:08:29,507 INFO : Running cycle 1/1 for kraken test... 20:08:29 INFO - 2015-11-11 20:08:29,507 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpEarvvx/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 20:08:41 INFO - 2015-11-11 20:08:41,247 DEBUG : BROWSER_OUTPUT: RSS: Main: 139403264 20:08:41 INFO - 2015-11-11 20:08:41,248 DEBUG : BROWSER_OUTPUT: 20:08:43 INFO - 2015-11-11 20:08:43,706 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46498/tests/kraken/driver.html?testName=audio-beat-detection) 20:08:44 INFO - 2015-11-11 20:08:44,287 DEBUG : BROWSER_OUTPUT: RSS: Main: 181510144 20:08:44 INFO - 2015-11-11 20:08:44,287 DEBUG : BROWSER_OUTPUT: 20:08:46 INFO - 2015-11-11 20:08:46,911 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46498/tests/kraken/driver.html?testName=audio-dft) 20:08:47 INFO - 2015-11-11 20:08:47,477 DEBUG : BROWSER_OUTPUT: RSS: Main: 171286528 20:08:47 INFO - 2015-11-11 20:08:47,477 DEBUG : BROWSER_OUTPUT: 20:08:50 INFO - 2015-11-11 20:08:50,299 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46498/tests/kraken/driver.html?testName=audio-fft) 20:08:50 INFO - 2015-11-11 20:08:50,860 DEBUG : BROWSER_OUTPUT: RSS: Main: 149250048 20:08:50 INFO - 2015-11-11 20:08:50,860 DEBUG : BROWSER_OUTPUT: 20:08:52 INFO - 2015-11-11 20:08:52,831 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46498/tests/kraken/driver.html?testName=audio-oscillator) 20:08:53 INFO - 2015-11-11 20:08:53,405 DEBUG : BROWSER_OUTPUT: RSS: Main: 153878528 20:08:53 INFO - 2015-11-11 20:08:53,406 DEBUG : BROWSER_OUTPUT: 20:08:55 INFO - 2015-11-11 20:08:55,543 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46498/tests/kraken/driver.html?testName=imaging-gaussian-blur) 20:08:56 INFO - 2015-11-11 20:08:56,104 DEBUG : BROWSER_OUTPUT: RSS: Main: 154341376 20:08:56 INFO - 2015-11-11 20:08:56,104 DEBUG : BROWSER_OUTPUT: 20:08:59 INFO - 2015-11-11 20:08:59,022 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46498/tests/kraken/driver.html?testName=imaging-darkroom) 20:08:59 INFO - 2015-11-11 20:08:59,595 DEBUG : BROWSER_OUTPUT: RSS: Main: 156295168 20:08:59 INFO - 2015-11-11 20:08:59,595 DEBUG : BROWSER_OUTPUT: 20:09:02 INFO - 2015-11-11 20:09:02,941 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46498/tests/kraken/driver.html?testName=imaging-desaturate) 20:09:03 INFO - 2015-11-11 20:09:03,510 DEBUG : BROWSER_OUTPUT: RSS: Main: 157302784 20:09:03 INFO - 2015-11-11 20:09:03,510 DEBUG : BROWSER_OUTPUT: 20:09:06 INFO - 2015-11-11 20:09:06,267 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46498/tests/kraken/driver.html?testName=json-parse-financial) 20:09:06 INFO - 2015-11-11 20:09:06,833 DEBUG : BROWSER_OUTPUT: RSS: Main: 156618752 20:09:06 INFO - 2015-11-11 20:09:06,833 DEBUG : BROWSER_OUTPUT: 20:09:08 INFO - 2015-11-11 20:09:08,402 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46498/tests/kraken/driver.html?testName=json-stringify-tinderbox) 20:09:08 INFO - 2015-11-11 20:09:08,963 DEBUG : BROWSER_OUTPUT: RSS: Main: 166801408 20:09:08 INFO - 2015-11-11 20:09:08,964 DEBUG : BROWSER_OUTPUT: 20:09:10 INFO - 2015-11-11 20:09:10,746 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46498/tests/kraken/driver.html?testName=stanford-crypto-aes) 20:09:11 INFO - 2015-11-11 20:09:11,335 DEBUG : BROWSER_OUTPUT: RSS: Main: 166932480 20:09:11 INFO - 2015-11-11 20:09:11,335 DEBUG : BROWSER_OUTPUT: 20:09:13 INFO - 2015-11-11 20:09:13,398 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46498/tests/kraken/driver.html?testName=stanford-crypto-ccm) 20:09:13 INFO - 2015-11-11 20:09:13,979 DEBUG : BROWSER_OUTPUT: RSS: Main: 175706112 20:09:13 INFO - 2015-11-11 20:09:13,979 DEBUG : BROWSER_OUTPUT: 20:09:16 INFO - 2015-11-11 20:09:16,394 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46498/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 20:09:16 INFO - 2015-11-11 20:09:16,975 DEBUG : BROWSER_OUTPUT: RSS: Main: 181657600 20:09:16 INFO - 2015-11-11 20:09:16,975 DEBUG : BROWSER_OUTPUT: 20:09:19 INFO - 2015-11-11 20:09:19,518 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46498/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 20:09:20 INFO - 2015-11-11 20:09:20,099 DEBUG : BROWSER_OUTPUT: RSS: Main: 178761728 20:09:20 INFO - 2015-11-11 20:09:20,100 DEBUG : BROWSER_OUTPUT: 20:09:21 INFO - 2015-11-11 20:09:21,748 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46498/tests/kraken/driver.html?testName=ai-astar) 20:09:21 INFO - 2015-11-11 20:09:21,999 DEBUG : BROWSER_OUTPUT: RSS: Main: 237596672 20:09:22 INFO - 2015-11-11 20:09:21,999 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:21,999 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:09:22 INFO - 2015-11-11 20:09:21,999 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:09:22 INFO - 2015-11-11 20:09:22,000 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:09:22 INFO - 2015-11-11 20:09:22,000 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:09:22 INFO - 2015-11-11 20:09:22,000 DEBUG : BROWSER_OUTPUT: |0;ai-astar;107;110;104;109;110;109;100;110;110;109 20:09:22 INFO - 2015-11-11 20:09:22,000 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;150;124;148;159;125;158;163;127;174;126 20:09:22 INFO - 2015-11-11 20:09:22,000 DEBUG : BROWSER_OUTPUT: |2;audio-dft;162;160;160;160;160;160;159;165;160;159 20:09:22 INFO - 2015-11-11 20:09:22,001 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;71;82;89;71;71;71;130;92;70 20:09:22 INFO - 2015-11-11 20:09:22,002 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;89;89;135;90;90;90;128;89;91;133 20:09:22 INFO - 2015-11-11 20:09:22,002 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;110;110;110;109;109;110;109;110;109 20:09:22 INFO - 2015-11-11 20:09:22,002 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;145;145;145;146;145;146;145;145;144;146 20:09:22 INFO - 2015-11-11 20:09:22,002 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;96;96;95;96;96;96;96;95;96 20:09:22 INFO - 2015-11-11 20:09:22,002 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;62;60;59;61;60;61;63;69;58;58 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;68;67;67;67;67;67;66;67;66 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;84;83;85;85;86;85;87;85;93;85 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;114;118;119;121;118;118;126;121;128;123 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;140;151;154;153;155;138;151;149;147;140 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;66;65;68;69;68;66;65;66;65;65 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: __start_cc_report 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,902 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: __end_cc_report 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: __startTimestamp1447301361998__endTimestamp 20:09:22 INFO - 2015-11-11 20:09:22,003 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,005 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:09:22 INFO - 2015-11-11 20:09:22,005 DEBUG : BROWSER_OUTPUT: Number of tests: 14 20:09:22 INFO - 2015-11-11 20:09:22,005 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,005 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:107.80 Median:109.50 stddev:3.33 (3.0%) stddev-sans-first:3.52 20:09:22 INFO - 2015-11-11 20:09:22,005 DEBUG : BROWSER_OUTPUT: Values: 107.0 110.0 104.0 109.0 110.0 109.0 100.0 110.0 110.0 109.0 20:09:22 INFO - 2015-11-11 20:09:22,005 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,005 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:145.40 Median:154.00 stddev:18.52 (12.0%) stddev-sans-first:19.57 20:09:22 INFO - 2015-11-11 20:09:22,005 DEBUG : BROWSER_OUTPUT: Values: 150.0 124.0 148.0 159.0 125.0 158.0 163.0 127.0 174.0 126.0 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:160.50 Median:160.00 stddev:1.78 (1.1%) stddev-sans-first:1.80 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: Values: 162.0 160.0 160.0 160.0 160.0 160.0 159.0 165.0 160.0 159.0 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:81.90 Median:71.50 stddev:18.80 (26.3%) stddev-sans-first:19.60 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: Values: 72.0 71.0 82.0 89.0 71.0 71.0 71.0 130.0 92.0 70.0 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:102.40 Median:89.50 stddev:20.51 (22.9%) stddev-sans-first:21.17 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: Values: 89.0 89.0 135.0 90.0 90.0 90.0 128.0 89.0 91.0 133.0 20:09:22 INFO - 2015-11-11 20:09:22,006 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,007 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.50 Median:110.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 20:09:22 INFO - 2015-11-11 20:09:22,007 DEBUG : BROWSER_OUTPUT: Values: 109.0 110.0 110.0 110.0 109.0 109.0 110.0 109.0 110.0 109.0 20:09:22 INFO - 2015-11-11 20:09:22,007 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,008 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:145.20 Median:145.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 20:09:22 INFO - 2015-11-11 20:09:22,008 DEBUG : BROWSER_OUTPUT: Values: 145.0 145.0 145.0 146.0 145.0 146.0 145.0 145.0 144.0 146.0 20:09:22 INFO - 2015-11-11 20:09:22,008 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,008 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.70 Median:96.00 stddev:0.48 (0.5%) stddev-sans-first:0.44 20:09:22 INFO - 2015-11-11 20:09:22,009 DEBUG : BROWSER_OUTPUT: Values: 95.0 96.0 96.0 95.0 96.0 96.0 96.0 96.0 95.0 96.0 20:09:22 INFO - 2015-11-11 20:09:22,009 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,009 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:61.10 Median:61.00 stddev:3.21 (5.3%) stddev-sans-first:3.39 20:09:22 INFO - 2015-11-11 20:09:22,009 DEBUG : BROWSER_OUTPUT: Values: 62.0 60.0 59.0 61.0 60.0 61.0 63.0 69.0 58.0 58.0 20:09:22 INFO - 2015-11-11 20:09:22,009 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,009 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:67.00 Median:67.00 stddev:0.67 (1.0%) stddev-sans-first:0.60 20:09:22 INFO - 2015-11-11 20:09:22,009 DEBUG : BROWSER_OUTPUT: Values: 68.0 68.0 67.0 67.0 67.0 67.0 67.0 66.0 67.0 66.0 20:09:22 INFO - 2015-11-11 20:09:22,010 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,010 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.80 Median:85.00 stddev:2.74 (3.2%) stddev-sans-first:2.83 20:09:22 INFO - 2015-11-11 20:09:22,010 DEBUG : BROWSER_OUTPUT: Values: 84.0 83.0 85.0 85.0 86.0 85.0 87.0 85.0 93.0 85.0 20:09:22 INFO - 2015-11-11 20:09:22,010 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,010 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:120.60 Median:121.00 stddev:4.17 (3.4%) stddev-sans-first:3.67 20:09:22 INFO - 2015-11-11 20:09:22,010 DEBUG : BROWSER_OUTPUT: Values: 114.0 118.0 119.0 121.0 118.0 118.0 126.0 121.0 128.0 123.0 20:09:22 INFO - 2015-11-11 20:09:22,010 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,011 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:147.80 Median:151.00 stddev:6.30 (4.2%) stddev-sans-first:6.02 20:09:22 INFO - 2015-11-11 20:09:22,011 DEBUG : BROWSER_OUTPUT: Values: 140.0 151.0 154.0 153.0 155.0 138.0 151.0 149.0 147.0 140.0 20:09:22 INFO - 2015-11-11 20:09:22,011 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,011 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.30 Median:66.00 stddev:1.49 (2.3%) stddev-sans-first:1.58 20:09:22 INFO - 2015-11-11 20:09:22,011 DEBUG : BROWSER_OUTPUT: Values: 66.0 65.0 68.0 69.0 68.0 66.0 65.0 66.0 65.0 65.0 20:09:22 INFO - 2015-11-11 20:09:22,011 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:09:22 INFO - 2015-11-11 20:09:22,011 DEBUG : BROWSER_OUTPUT: 20:09:22 INFO - 2015-11-11 20:09:22,851 INFO : Browser exited with error code: 0 20:09:22 INFO - 2015-11-11 20:09:22,906 INFO : Completed test kraken (00:00:58) 20:09:22 INFO - 2015-11-11 20:09:22,906 INFO : Starting test v8_7 20:09:22 INFO - 2015-11-11 20:09:22,906 DEBUG : operating with platform_type : linux_ 20:09:22 INFO - 2015-11-11 20:09:22,907 INFO : Initialising browser for v8_7 test... 20:09:22 INFO - 2015-11-11 20:09:22,913 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpJgGSA2/profile http://localhost:46498/getInfo.html 20:09:26 INFO - 2015-11-11 20:09:26,404 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 20:09:26 INFO - 2015-11-11 20:09:26,404 DEBUG : BROWSER_OUTPUT: colorDepth:24 20:09:26 INFO - 2015-11-11 20:09:26,404 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 20:09:26 INFO - 2015-11-11 20:09:26,404 DEBUG : BROWSER_OUTPUT: __metrics 20:09:26 INFO - 2015-11-11 20:09:26,541 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 20:09:27 INFO - 2015-11-11 20:09:27,633 INFO : Browser initialized. 20:09:27 INFO - 2015-11-11 20:09:27,633 INFO : Running cycle 1/1 for v8_7 test... 20:09:27 INFO - 2015-11-11 20:09:27,633 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpJgGSA2/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 20:09:39 INFO - 2015-11-11 20:09:39,379 DEBUG : BROWSER_OUTPUT: RSS: Main: 141500416 20:09:39 INFO - 2015-11-11 20:09:39,380 DEBUG : BROWSER_OUTPUT: 20:10:00 INFO - 2015-11-11 20:10:00,751 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:46498/tests/v8_7/run.html (next: http://localhost:46498/tests/v8_7/run.html) 20:10:01 INFO - 2015-11-11 20:10:01,002 DEBUG : BROWSER_OUTPUT: RSS: Main: 628043776 20:10:01 INFO - 2015-11-11 20:10:01,002 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,003 DEBUG : BROWSER_OUTPUT: __start_tp_report 20:10:01 INFO - 2015-11-11 20:10:01,003 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 20:10:01 INFO - 2015-11-11 20:10:01,003 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 20:10:01 INFO - 2015-11-11 20:10:01,003 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 20:10:01 INFO - 2015-11-11 20:10:01,003 DEBUG : BROWSER_OUTPUT: |0;Richards;165.34391534391534 20:10:01 INFO - 2015-11-11 20:10:01,004 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;187.51171948246764 20:10:01 INFO - 2015-11-11 20:10:01,004 DEBUG : BROWSER_OUTPUT: |2;Encrypt;281.214848143982 20:10:01 INFO - 2015-11-11 20:10:01,004 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5040.201005025126 20:10:01 INFO - 2015-11-11 20:10:01,004 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1118.5682326621925 20:10:01 INFO - 2015-11-11 20:10:01,004 DEBUG : BROWSER_OUTPUT: |5;Earley;784.9293563579278 20:10:01 INFO - 2015-11-11 20:10:01,004 DEBUG : BROWSER_OUTPUT: |6;Boyer;11639.53488372093 20:10:01 INFO - 2015-11-11 20:10:01,004 DEBUG : BROWSER_OUTPUT: |7;RegExp;25000 20:10:01 INFO - 2015-11-11 20:10:01,004 DEBUG : BROWSER_OUTPUT: |8;Splay;670.8360763660303 20:10:01 INFO - 2015-11-11 20:10:01,005 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4822.115384615385 20:10:01 INFO - 2015-11-11 20:10:01,005 DEBUG : BROWSER_OUTPUT: __end_tp_report 20:10:01 INFO - 2015-11-11 20:10:01,005 DEBUG : BROWSER_OUTPUT: __startTimestamp1447301400999__endTimestamp 20:10:01 INFO - 2015-11-11 20:10:01,005 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,005 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 20:10:01 INFO - 2015-11-11 20:10:01,005 DEBUG : BROWSER_OUTPUT: Number of tests: 10 20:10:01 INFO - 2015-11-11 20:10:01,005 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,005 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:165.34 Median:165.34 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,006 DEBUG : BROWSER_OUTPUT: Values: 165.3 20:10:01 INFO - 2015-11-11 20:10:01,006 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,006 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:187.51 Median:187.51 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,006 DEBUG : BROWSER_OUTPUT: Values: 187.5 20:10:01 INFO - 2015-11-11 20:10:01,006 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,006 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:281.21 Median:281.21 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,006 DEBUG : BROWSER_OUTPUT: Values: 281.2 20:10:01 INFO - 2015-11-11 20:10:01,006 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,007 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5040.20 Median:5040.20 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,007 DEBUG : BROWSER_OUTPUT: Values: 5040.2 20:10:01 INFO - 2015-11-11 20:10:01,007 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,007 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1118.57 Median:1118.57 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,007 DEBUG : BROWSER_OUTPUT: Values: 1118.6 20:10:01 INFO - 2015-11-11 20:10:01,007 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,008 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:784.93 Median:784.93 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,008 DEBUG : BROWSER_OUTPUT: Values: 784.9 20:10:01 INFO - 2015-11-11 20:10:01,008 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,008 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11639.53 Median:11639.53 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,008 DEBUG : BROWSER_OUTPUT: Values: 11639.5 20:10:01 INFO - 2015-11-11 20:10:01,008 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,008 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:25000.00 Median:25000.00 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,008 DEBUG : BROWSER_OUTPUT: Values: 25000.0 20:10:01 INFO - 2015-11-11 20:10:01,008 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,009 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:670.84 Median:670.84 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,009 DEBUG : BROWSER_OUTPUT: Values: 670.8 20:10:01 INFO - 2015-11-11 20:10:01,009 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,009 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4822.12 Median:4822.12 stddev:0.00 (0.0%) 20:10:01 INFO - 2015-11-11 20:10:01,009 DEBUG : BROWSER_OUTPUT: Values: 4822.1 20:10:01 INFO - 2015-11-11 20:10:01,009 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 20:10:01 INFO - 2015-11-11 20:10:01,009 DEBUG : BROWSER_OUTPUT: 20:10:01 INFO - 2015-11-11 20:10:01,908 INFO : Browser exited with error code: 0 20:10:01 INFO - 2015-11-11 20:10:01,919 INFO : Completed test v8_7 (00:00:39) 20:10:02 INFO - 2015-11-11 20:10:02,035 INFO : Completed test suite (00:20:08) 20:10:02 INFO - 2015-11-11 20:10:02,035 DEBUG : Working with test: dromaeo_css 20:10:02 INFO - 2015-11-11 20:10:02,035 DEBUG : Generating results file: dromaeo_css 20:10:02 INFO - 2015-11-11 20:10:02,036 DEBUG : Working with test: kraken 20:10:02 INFO - 2015-11-11 20:10:02,036 DEBUG : Generating results file: kraken 20:10:02 INFO - 2015-11-11 20:10:02,037 INFO : javascript benchmark 20:10:02 INFO - 2015-11-11 20:10:02,037 DEBUG : Working with test: v8_7 20:10:02 INFO - 2015-11-11 20:10:02,037 DEBUG : Generating results file: v8_7 20:10:02 INFO - 2015-11-11 20:10:02,037 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:10:02 INFO - 2015-11-11 20:10:02,105 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,64,35]] 20:10:02 INFO - 2015-11-11 20:10:02,106 DEBUG : process_Request line: dromaeo_css 6935.24 graph.html#tests=[[72,64,35]] 20:10:02 INFO - 2015-11-11 20:10:02,106 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:10:07 INFO - 2015-11-11 20:10:07,057 DEBUG : process_Request line: kraken 1497.00 graph.html#tests=[[232,64,35]] 20:10:07 INFO - 2015-11-11 20:10:07,057 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 20:10:08 INFO - 2015-11-11 20:10:08,020 DEBUG : process_Request line: v8_7 21056.60 graph.html#tests=[[230,64,35]] 20:10:08 INFO - 2015-11-11 20:10:08,021 INFO : javascript benchmark 20:10:08 INFO - 2015-11-11 20:10:08,024 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [354.6949623323941, 355.58929436500836, 355.93237284915847, 357.47808200027947, 359.07179939855473, 14531.0, 14540.491082812103, 16928.238229279683, 17514.0, 18450.44648660539, 15156.166410847427, 15525.456609018658, 15601.375944962188, 15602.843971560282, 16333.5916602085, 5164.586833053366, 5285.445028272034, 5288.629795914288, 5295.179247216687, 5326.946730532683, 3903.2583809076327, 4023.4970628671417, 5258.92111618326, 5287.154055351145, 5853.970730146343, 5874.970625146868, 5928.644281343133, 5939.376365481606, 5957.6723280219785, 5964.165016897616, 5795.333536643277, 5894.17481552583, 5894.911576326359, 5905.586608937398, 6031.487323577501, 5159.1229490986625, 5159.509846564571, 5176.818811341623, 5181.145111056671, 5183.533481986639, 20285.0, 20759.169633214653, 20760.792392076037, 21047.158113675436, 21392.679109813365, 2037.7350944377283, 2105.0632468551503, 2254.211026140854, 2461.729209786922, 2466.8643224622638, 13240.404181811842, 13248.40382182804, 13249.867501325056, 13606.38771255296, 13848.792268115987, 1824.2247045005952, 1831.2583403721515, 1855.5824939388665, 1865.6268746250805, 1871.5563363411252, 60915.08627370637, 61496.0, 62756.0, 63129.36870631281, 63770.68114659397, 9633.518324083769, 9805.607775688892, 10005.649802256887, 10009.498575213776, 10076.294659373774, 12839.972802175804, 12849.678758030937, 12888.0, 12900.29048402347, 12910.870891290966, 6839.350261725128, 6918.308169183041, 6953.235144134142, 7002.579845209304, 7015.89476157858, 6512.902306465407, 6567.9671601641685, 6578.440832529192, 6594.021793461942, 6603.8349041273395, 5894.469497745138, 5971.5222782177325, 6016.0, 6025.969870150709, 6032.849178770566, 1625.3336132185748, 1702.821203773586, 1733.2027267456858, 1744.398182627017, 1777.2091419318278, 833.6457005772522, 890.6927110147119, 926.0322962504199, 1001.7445551384351, 1008.4251976373544, 10815.891841081646, 11807.933611617933, 12466.688332791753, 12512.74974500523, 17714.291428342978, 491.35877679627714, 491.70251997541686, 501.2581379558274, 505.89376230991166, 520.4821202903136, 4650.465196502378, 6505.186851643544, 6546.738130474728, 6607.702653380609, 6634.0712300278, 539495.0, 545042.0, 545885.0, 558558.0, 559625.0, 78034.6098269505, 82176.17823821805, 82900.0, 82990.58504707438, 83921.0, 552.6711606594071, 566.8639526513607, 572.241779641976, 572.8682403047239, 573.4323020210046, 11115.610953616584, 11462.541498340306, 11565.306081635128, 11575.76848463043, 11656.417179141179, 36737.81631091934, 36996.44505332368, 37686.81156594309, 40082.59917400789, 40484.59515404926, 46743.76628116838, 47199.29201061918, 49181.50818491769, 53219.0, 53862.730686346316, 14021.158730476203, 14995.925020374829, 15033.0, 15178.0, 15393.0, 17916.731249031534, 18132.909335453238, 18333.54166145857, 18849.434516964513, 19640.0, 15540.145292008596, 15713.607159821097, 16067.598310042342, 16467.505974820775, 16480.17599120015, 15220.391184352502, 15415.61460963485, 15568.455104071303, 16077.67844643124, 16229.59426014359, 12767.629344858151, 14014.719705606034, 15467.303971321093, 15951.920240398724, 16255.51233462998, 14173.574792756233, 14440.638984025483, 14497.347619356944, 14509.419623214953, 14661.413543458142, 15076.246187690791, 15112.546623601309, 15215.08709477435, 15689.0, 15730.606734831721], "dojo.html": [3162.8576714047867, 3217.2117831131377, 3283.261266215102, 3287.572615559977, 3315.685009924058, 5264.052470555299, 5402.6758394496355, 5433.347998240211, 5485.0, 5501.779928802848, 5373.328333958255, 5420.970015697015, 5421.756020979055, 5438.075527160382, 5446.428125046872, 4955.554000139978, 4986.10250154972, 5011.0228505441455, 5017.799288028475, 5038.470960549144, 4899.387576552931, 5092.388913330406, 5094.083065048289, 5155.974220128895, 5183.559397451202, 4914.97542512287, 4958.107540642683, 4978.82574109908, 4993.575546078588, 5020.171671674169, 4931.432885218174, 4947.925781113287, 4948.777305021283, 4968.677035992649, 4974.825881094181, 4819.6867203631655, 4925.975370123162, 4934.407871055496, 4951.851444456672, 4977.576905962997, 5228.660137091115, 5324.760385782649, 5327.786888524493, 5329.0, 5332.413434522199, 5949.6430214187285, 5985.25184351956, 6010.819675409744, 6011.3086994995265, 6012.729427175787, 5788.652680839163, 5834.824955251349, 5937.109433584954, 6021.096835474714, 6041.516678665696, 5590.692511911843, 5613.887722245614, 5619.943800561983, 5620.044592419298, 5621.325440947072, 6070.484008859208, 6077.1491991121275, 6078.544109191828, 6079.726412311456, 6096.481799047042, 5543.695096769636, 5633.521150702154, 5780.797672081457, 5910.113482977587, 5911.261092363455, 5943.702814859326, 5956.374580669054, 5957.553183511254, 5959.851003724855, 5965.075413310944, 5919.6152250103605, 5920.467157955804, 5930.9406905931255, 5934.643921364732, 5936.762529498858, 5718.399568045378, 5836.562257830679, 5852.297724273029, 5904.5571582131515, 5946.494547963472, 4491.966847624999, 4508.954910450919, 4523.864284071483, 4535.818567257339, 4558.49856515783, 3926.528816541976, 4029.6574791142493, 4042.130941847458, 4049.676025917978, 4079.224947260011, 5503.229547863302, 5516.586256030814, 5568.44315568448, 5591.4688104629995, 5637.9718101409235, 5852.882942341129, 5867.647941123546, 5876.382979787147, 5884.08796636522, 5895.734691938873, 5330.840074797762, 5487.780488780404, 5534.4742249486235, 5540.0, 5554.055810512223, 5050.595952323805, 5103.209002604603, 5103.362079740033, 5117.462666419972, 5136.666116702402, 6134.294556126013, 6161.383861613893, 6161.537884658579, 6164.506839452833, 6179.16581261533, 5783.971080144573, 5887.941120588739, 5925.229720136354, 5928.0, 5942.286925568959, 5958.672273025025, 6021.969890150521, 6023.247094113236, 6023.939760602338, 6041.758329666764, 5836.854078648068, 5839.532837373085, 5842.1820945068575, 5851.561132915133, 5867.647941123546, 5732.484076433141, 5839.737211825393, 5856.970715146397, 5909.025010873158, 5922.170896074639, 5678.318601767649, 5688.260526131577, 5691.26013618227, 5700.629459085146, 5775.220345253337, 5663.093904975184, 5666.291713535808, 5668.03643380618, 5671.319441667027, 5677.460641239076, 5456.508914197741, 5566.554675626021, 5567.7494512747835, 5570.470805273492, 5695.373508913934, 5760.827175184583, 5801.448862358069, 5827.329857066492, 5854.531637468907, 5876.941230587639, 5688.7440065198, 5694.572907031907, 5711.914321285101, 5729.4843464088435, 5734.741936612946], "mootools.html": [1520.0423733048192, 1656.1139790212235, 1712.9082006977405, 1756.3677076252548, 1789.9194536245868, 6951.0, 7478.700851965922, 7691.615419229037, 7703.653335599897, 7706.152323244439, 7538.924610753891, 7792.532448053121, 7794.727184548542, 7800.7269745558915, 7806.687732490708, 1985.7418535590352, 2040.9081591328352, 2210.5247371815058, 2266.8073213776806, 2292.8280378971563, 2259.378670865517, 2261.9321420357332, 2264.275431861805, 2265.1958554713087, 2267.7845604667614, 2207.2054060538194, 2308.480591866825, 2308.6883270758485, 2309.3302942146756, 2311.8959646815933, 1964.1357802566897, 1998.2007197121195, 2184.1263494602126, 2237.7538470768204, 2242.024719247133, 2161.232762369352, 2164.0, 2197.1540956731615, 2198.505336299336, 2212.7565967743535, 7618.733344332977, 7642.0, 7689.19263477338, 7701.653425595806, 7707.807304817368, 4482.9551704482865, 4551.044280701057, 4561.475430325489, 4601.953980460186, 4602.010567727954, 2992.147238037149, 3042.574039634453, 3067.8926237581577, 3072.201227680797, 3116.1897906544464, 967.8741763570761, 978.280963491833, 980.6567701304558, 1007.3754272351116, 1017.6387382479187, 10450.895491045145, 10459.895401045967, 10480.318779279398, 10488.475576221159, 10491.790164196673, 4174.123434078878, 4245.3844192591905, 4292.399064131024, 4303.117860838521, 4306.310990241546, 9129.908700913038, 9139.588718507683, 9149.405288656217, 9153.496557689392, 9160.129787670161, 4663.020765639186, 4664.510226426177, 4668.229742092517, 4672.486026537078, 4677.368555245066, 4181.811818468176, 4208.894777630522, 4214.325707886785, 4216.451861258017, 4227.260229459832, 3612.2956023575152, 3617.113807117273, 3659.908502287464, 3672.265546890633, 3701.759385639925, 1133.6145710458484, 1152.9711757206137, 1166.4078532802664, 1179.775842589905, 1184.2420850655587, 1313.5862203405898, 1319.9736005280033, 1336.1248382309602, 1351.3648585164956, 1353.6683512539294, 6994.510384273154, 7098.751543695946, 7139.250378710264, 7145.214026457085, 7157.713691452388, 457.7047804166361, 458.84857996860956, 477.32935226007515, 485.0178388762713, 485.9125357435625, 5709.885802283931, 5766.798162064308, 5768.278965129359, 5780.104083867007, 5789.218455508537, 8814.515201663842, 9044.095590441035, 9280.62877484893, 9281.535923203814, 9328.0, 9243.214326782165, 9245.491497967541, 9251.0, 9251.398659087137, 9255.074492550692, 7234.6382680865745, 7294.70821167158, 7364.079490063742, 7369.410447164321, 7444.627768611656, 7382.926170738224, 7438.256174382518, 7440.7023719052795, 7445.702171913063, 7454.552726836408, 8213.260806527442, 8219.178082191733, 8343.749687509384, 8360.205780450848, 8500.957495212484, 8490.65008859884, 8593.484390936565, 8595.0, 8595.613197406006, 8603.354748393771, 6943.930560694328, 7080.610566418896, 7091.787246382617, 7092.645367731489, 7095.290470952863, 7572.697092116254, 7614.314711675976, 7614.733484328243, 7626.8855967159425, 7634.274743899321, 6390.456811171102, 6979.476539259677, 7171.354578087997, 7223.927760722536, 7322.340989310775, 6389.584676995981, 6482.060101285381, 6916.792496225121, 6966.477514186355, 7007.0, 6588.209414870246, 6752.426043786333, 6836.829079273058, 6840.31596840312, 6842.315768423118, 6453.45145662624, 6493.415592596689, 6502.642354670538, 6504.804855854332, 6508.642024688687, 6579.934200658124, 6608.273089960005, 6610.0, 6611.140551728245, 6615.536912416084], "ext.html": [558.8044184535413, 582.7843697831803, 593.190295246988, 600.2287061126452, 602.6745557399004, 32277.354452910928, 33085.172870678216, 37011.25977480449, 37318.81340593293, 37385.06537336568, 40903.0, 41274.0, 41302.793486032606, 41454.0, 41739.58260417395, 7715.382769378464, 7944.324732397753, 8825.823483530325, 9028.232600228988, 9037.231835293975, 10651.78696426071, 10887.074598659085, 10887.945560272188, 10888.945555272252, 10892.509837057352, 10608.15134789215, 10648.254622176451, 10712.571497140105, 10721.80203058375, 10750.78498430031, 7844.843103137934, 8026.0, 10397.220208484356, 10626.0, 10874.510647020903, 10447.52986115619, 10562.26064175508, 10598.947005264925, 10605.681829545127, 10605.787884242349, 41076.79461602703, 41438.79280603577, 41467.585324146676, 41577.168456631, 41594.58405415937, 3197.904062878094, 3226.887058952949, 3235.4499735045097, 3261.3803377358463, 3288.983555082233, 30672.0, 30677.846610766803, 31026.0, 31176.0, 31936.0, 3457.3360566340734, 3465.3935561276926, 3468.3410152071024, 3473.9652603473896, 3509.31568344173, 277551.0, 278623.0, 278945.0, 279584.0, 279979.0, 58441.0, 59722.0, 60387.0, 60894.69552652297, 61017.38982610206, 56505.43494565084, 56838.0, 56843.431565683815, 56911.43088569144, 56944.715276424184, 12407.875921240853, 12411.255324680547, 12519.56181533642, 12546.0, 12695.174813637084, 9173.266138708887, 9198.494082825375, 9207.033261507579, 9209.217216536535, 9213.493257870881, 20558.0, 20739.0, 20740.896295518425, 20797.272095476586, 20806.479838003866, 7604.163542010375, 7655.846883062308, 7730.613469326511, 7744.845103097907, 7817.0, 935.854942483916, 998.276249718948, 1007.8488226766044, 1061.3631820907394, 1064.297563608015, 28063.298417539725, 28817.0, 28962.565561516592, 29251.707482925325, 29262.0, 948.9762755931018, 977.5894124467741, 1031.4791030529684, 1056.054830926332, 1060.4008735064663, 14382.424703011762, 14854.702905942037, 14920.477783277533, 15135.621609459851, 15140.621484462756, 329887.0, 336562.0, 336836.0, 337089.0, 337146.0, 51859.48140518622, 52206.474190726156, 52212.0, 52268.21597676038, 52279.0, 1340.7117469744053, 1362.3801170467414, 1363.6522686715023, 1370.8080868678394, 1456.5047883719585, 23598.938047787546, 30927.0, 31167.844160779958, 31207.0, 31524.68475315309, 49342.25986610132, 49833.252501211784, 49870.0, 49906.50093499019, 49942.25086623631, 279771.0, 282409.0, 282473.0, 282531.0, 283354.0, 29547.556786647787, 30018.24954376158, 31665.683343166274, 32237.0, 32502.0, 39111.0, 39170.0, 39401.46883108479, 39534.604653953094, 40100.1979960405, 33140.0, 33565.66434335626, 33977.150571235914, 34049.31901362009, 36510.63489365072, 28582.857085714437, 31958.201044974063, 34869.476957845145, 36013.0, 36505.0, 34366.5908448922, 35428.64571354254, 35633.82183089068, 35898.10254743652, 35905.28189436145, 31759.0, 32223.35553288968, 32509.553886904483, 32547.14151452761, 32699.0, 24617.261482155565, 24861.254162375157, 24863.50272994494, 25010.624840627042, 25164.49671006606], "prototype.html": [329.9307145499445, 331.17041810265283, 332.44149828288465, 334.9112485191425, 336.73566250493354, 5655.5475561955045, 5818.41815818419, 5847.44449277319, 5868.4131586841295, 5883.176355310255, 5609.691466969325, 5677.545796336293, 5692.060809966361, 5731.0, 5756.222909907161, 4371.759553224571, 4408.559144085598, 4435.046465010022, 4440.533743956887, 4444.622207112399, 4281.079567892903, 4354.912901741964, 4368.759718215497, 4418.911621767563, 4439.733615983051, 4386.451693538308, 4390.912181756379, 4399.05420334628, 4412.139632771611, 4413.735175889441, 4393.978030109861, 4401.515833258339, 4407.3388991651345, 4407.537208593099, 4409.294512877924, 3862.8261728222296, 3873.438351439054, 3879.2241551689776, 3879.670228030621, 3883.1262965832743, 5360.035193665139, 5467.0705979983495, 5473.17902314652, 5499.50504454597, 5523.28197334344, 5112.46319136489, 5116.053530096944, 5118.053160165381, 5120.6927584344685, 5122.590192784568, 6014.188084608566, 6036.547258955596, 6039.275286965549, 6046.879062418771, 6075.392460753934, 4089.3661482470266, 4145.585441455861, 4174.415581818548, 4205.0, 4208.137331846964, 6242.282137554194, 6262.060690896356, 6265.436110750009, 6272.15325930998, 6284.4344009039405, 4283.186194623074, 4285.3786201000685, 4285.721428107163, 4287.614114729627, 4289.935650965238, 4251.702380833374, 4330.848420305274, 4336.501302350207, 4337.9783101084295, 4338.501072376654, 5075.619328550373, 5077.898442031139, 5081.3140226069745, 5084.872878178076, 5086.5422112009355, 6149.0776383542825, 6155.84610384744, 6157.907631385533, 6181.8454538636, 6190.0405437157315, 1590.6421055262704, 1612.9596760080858, 1614.088040257251, 1615.240836806699, 1615.6041769766482, 1080.1790639114329, 1085.159001773616, 1088.2871719024051, 1099.1756182862853, 1105.972350691223, 5956.047032474783, 5959.046552551571, 5961.5230781537375, 5963.344032156459, 5966.463018328372, 6290.55966082379, 6305.211848518935, 6308.3060863305, 6313.96843015782, 6316.0, 5914.585978981516, 5919.6152250103605, 5965.492933100648, 5972.283326000821, 5975.970120149372, 3451.516787649731, 3535.6287589803214, 3541.2740388220354, 3541.8937431877084, 3541.8937431877084, 6624.337566243434, 6632.900506492407, 6635.4359879410795, 6636.402723754885, 6641.402273795382, 6518.511111666644, 6523.282438931714, 6526.6946610677105, 6533.346665333524, 6535.0850880876715, 6477.4494167996245, 6578.934210657928, 6620.304867988888, 6631.602103873783, 6632.701528431136, 6342.23893132827, 6375.776847810304, 6379.744810207725, 6385.521085918482, 6387.105805187371, 6127.050307202391, 6155.0, 6221.253449586078, 6278.686065696788, 6288.496920246461, 6472.644004579794, 6512.804615861532, 6528.445082168069, 6530.67346632676, 6544.6727663615675, 4325.091730736581, 4354.346847972829, 4359.60763531271, 4362.127574485179, 4364.716293440916, 6157.753689852356, 6295.307516173126, 6311.526635502264, 6316.368363163647, 6317.147185129948, 6187.041008643668, 6196.194494715658, 6213.875722485434, 6223.190985171898, 6225.595336303126, 6201.565890387629, 6208.192934918612, 6210.0, 6216.316205217332, 6219.968900155471, 5990.281166259902, 6118.326984031664, 6119.694015299307, 6122.5408094392205, 6134.35589263121, 6237.594556353823, 6253.843653908507, 6254.3745625437095, 6256.468200203034, 6256.906146407899, 6057.757689692363, 6111.663858487826, 6125.234345706786, 6126.724297406538, 6129.387061293835], "yui.html": [795.3319211862034, 802.1697543042952, 811.9837603247931, 824.6701319472212, 835.8704400817874, 12996.41516131774, 13232.603021909346, 13288.46846126155, 14408.711825763505, 14438.855611443882, 13459.5289164879, 13555.457781688721, 13574.592762217124, 13577.117487363315, 13582.932085339584, 685.0170006041346, 689.6276010954078, 811.111832543364, 830.0, 831.3972370031709, 815.1440986963694, 822.8847961285425, 829.7178959153887, 830.3730683334104, 830.3979614779297, 868.1405408645427, 875.7285241575132, 876.2464280718609, 876.5792419638577, 876.8684697295392, 700.6076597105612, 708.3837061756279, 837.2966707965338, 851.6380538271272, 858.8840506531601, 623.1867413025999, 624.8843963866699, 628.1269036039909, 628.3276893723718, 629.3832044596276, 12953.352332383343, 13181.143225690299, 13182.670433239246, 13190.802137967938, 13206.801897971538, 11679.883201167964, 12428.120573544376, 13037.543685970946, 13134.802977955338, 13555.25446100464, 10069.546870390777, 10097.646582369582, 10129.645462408855, 10319.461853847537, 10324.638637647722, 3387.9830600847085, 3410.8635654573786, 3478.6521347865264, 3506.8772592959126, 3511.91220219494, 48009.0, 48467.27299090516, 48495.27257091147, 48772.26841597379, 48857.75571122157, 9690.0, 9777.951110244403, 9873.901260987299, 9999.150072243796, 10036.197104231644, 19380.70928936067, 19384.515387115436, 19416.805831941783, 19453.51366215856, 19462.61074778525, 7433.591152486557, 7555.584442855696, 7609.353204977639, 7699.807504812425, 7955.403344749051, 4339.370791235317, 4369.956300436955, 4376.102898905717, 4463.285874260103, 4473.038296766211, 3052.374263276023, 3104.363605460875, 3106.192389978622, 3106.8601912913973, 3111.175538482304, 427.40377173842313, 437.07994671217267, 445.7080612199015, 449.80883124671885, 450.2975358440843, 564.4750382144645, 658.4443510714513, 660.6960798032862, 670.6479098473243, 674.0563211503836, 8434.873476897852, 8465.238128568459, 8481.109483504266, 8490.278326342206, 8670.560422750741, 523.1472699499867, 541.8509909774843, 596.5615272774508, 663.3068443476578, 677.2482544375739, 3967.484227050523, 4212.726172798758, 4224.894377640522, 4326.156399502067, 4364.4568923285615, 57443.71278143666, 57613.711931440914, 57712.71143644255, 57880.0, 57935.42064579385, 47207.763961179975, 47384.0, 47697.28454073192, 47734.28398574024, 47826.28260576094, 46295.30557041647, 46589.534104658516, 46600.30099548509, 47716.7614161927, 48494.272585910534, 8334.249917507454, 8405.579721014046, 8527.147285271423, 8529.019162796358, 8760.342974276828, 33911.491327630596, 34366.82816585901, 35371.0, 35509.28981420409, 36050.63949360578, 40678.593214068664, 42018.0, 42565.5743442574, 42781.57218427776, 43260.567394325655, 8235.547044912588, 8307.0, 8572.314214862921, 8675.132486751274, 8786.824263514822, 12019.0, 12257.509699611915, 12386.0, 12847.871521285042, 12951.870481295067, 11182.32906025641, 11268.549258029587, 11496.310221386744, 11746.823797642872, 11865.762684746429, 11432.599859005228, 11529.48189359674, 11770.470328835394, 11794.587189448328, 12369.0, 11308.7738245233, 11642.592509262135, 11726.179167458537, 11832.46753896094, 11977.820332695192, 9859.0, 9872.141505976759, 10063.144632706302, 10099.848502272325, 10182.338148020355, 9284.628614855601, 9293.442393456415, 9796.216302695624, 9962.302638815214, 10115.0]}, "summary": {"lowerIsBetter": false, "suite": 6935.241228589961, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 8780.642426949407, "unit": "ms", "value": 8780.642426949407}, "dojo.html": {"lowerIsBetter": false, "filtered": 5421.684657421844, "unit": "ms", "value": 5421.684657421844}, "mootools.html": {"lowerIsBetter": false, "filtered": 4372.775482666129, "unit": "ms", "value": 4372.775482666129}, "ext.html": {"lowerIsBetter": false, "filtered": 18472.284673333124, "unit": "ms", "value": 18472.284673333124}, "prototype.html": {"lowerIsBetter": false, "filtered": 4645.181974232084, "unit": "ms", "value": 4645.181974232084}, "yui.html": {"lowerIsBetter": false, "filtered": 6228.571980870147, "unit": "ms", "value": 6228.571980870147}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-053"}, "testrun": {"date": 1447300193, "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": "20151111173002", "branch": "Fx-Team", "revision": "5f9371f97e1e21f10fa20b39f33774116cfcf5f0"}}, {"talos_counters": {}, "results": {"audio-dft": [162.0, 160.0, 160.0, 160.0, 160.0, 160.0, 159.0, 165.0, 160.0, 159.0], "ai-astar": [107.0, 110.0, 104.0, 109.0, 110.0, 109.0, 100.0, 110.0, 110.0, 109.0], "imaging-gaussian-blur": [109.0, 110.0, 110.0, 110.0, 109.0, 109.0, 110.0, 109.0, 110.0, 109.0], "audio-beat-detection": [150.0, 124.0, 148.0, 159.0, 125.0, 158.0, 163.0, 127.0, 174.0, 126.0], "json-stringify-tinderbox": [68.0, 68.0, 67.0, 67.0, 67.0, 67.0, 67.0, 66.0, 67.0, 66.0], "stanford-crypto-pbkdf2": [140.0, 151.0, 154.0, 153.0, 155.0, 138.0, 151.0, 149.0, 147.0, 140.0], "json-parse-financial": [62.0, 60.0, 59.0, 61.0, 60.0, 61.0, 63.0, 69.0, 58.0, 58.0], "stanford-crypto-sha256-iterative": [66.0, 65.0, 68.0, 69.0, 68.0, 66.0, 65.0, 66.0, 65.0, 65.0], "audio-fft": [72.0, 71.0, 82.0, 89.0, 71.0, 71.0, 71.0, 130.0, 92.0, 70.0], "imaging-darkroom": [145.0, 145.0, 145.0, 146.0, 145.0, 146.0, 145.0, 145.0, 144.0, 146.0], "stanford-crypto-ccm": [114.0, 118.0, 119.0, 121.0, 118.0, 118.0, 126.0, 121.0, 128.0, 123.0], "audio-oscillator": [89.0, 89.0, 135.0, 90.0, 90.0, 90.0, 128.0, 89.0, 91.0, 133.0], "stanford-crypto-aes": [84.0, 83.0, 85.0, 85.0, 86.0, 85.0, 87.0, 85.0, 93.0, 85.0], "imaging-desaturate": [95.0, 96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0, 95.0, 96.0]}, "summary": {"lowerIsBetter": true, "suite": 1496.9999999999998, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 81.9, "unit": "ms", "value": 81.9}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 147.8, "unit": "ms", "value": 147.8}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 145.4, "unit": "ms", "value": 145.4}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 120.6, "unit": "ms", "value": 120.6}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 145.2, "unit": "ms", "value": 145.2}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 61.1, "unit": "ms", "value": 61.1}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 102.4, "unit": "ms", "value": 102.4}, "ai-astar": {"lowerIsBetter": true, "filtered": 107.8, "unit": "ms", "value": 107.8}, "audio-dft": {"lowerIsBetter": true, "filtered": 160.5, "unit": "ms", "value": 160.5}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 66.3, "unit": "ms", "value": 66.3}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 67.0, "unit": "ms", "value": 67.0}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 109.5, "unit": "ms", "value": 109.5}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 85.8, "unit": "ms", "value": 85.8}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 95.7, "unit": "ms", "value": 95.7}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-053"}, "testrun": {"date": 1447300193, "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": "20151111173002", "branch": "Fx-Team", "revision": "5f9371f97e1e21f10fa20b39f33774116cfcf5f0"}}, {"talos_counters": {}, "results": {"DeltaBlue": [187.51171948246764], "Encrypt": [281.214848143982], "NavierStokes": [4822.115384615385], "Decrypt": [5040.201005025126], "Splay": [670.8360763660303], "Richards": [165.34391534391534], "RegExp": [25000.0], "Earley": [784.9293563579278], "Boyer": [11639.53488372093], "RayTrace": [1118.5682326621925]}, "summary": {"lowerIsBetter": false, "suite": 21056.595455472474, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 352.60729399999997, "unit": "score", "value": 352.60729399999997}, "Encrypt": {"lowerIsBetter": false, "filtered": 946.5396360000002, "unit": "score", "value": 946.5396360000002}, "NavierStokes": {"lowerIsBetter": false, "filtered": 307.7487537387835, "unit": "score", "value": 307.7487537387835}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.81158424725827, "unit": "score", "value": 52.81158424725827}, "Splay": {"lowerIsBetter": false, "filtered": 121.4767703631011, "unit": "score", "value": 121.4767703631011}, "RegExp": {"lowerIsBetter": false, "filtered": 36.43939999999999, "unit": "score", "value": 36.43939999999999}, "Richards": {"lowerIsBetter": false, "filtered": 213.506496, "unit": "score", "value": 213.506496}, "Earley": {"lowerIsBetter": false, "filtered": 849.0738620000004, "unit": "score", "value": 849.0738620000004}, "Boyer": {"lowerIsBetter": false, "filtered": 57.25855944055944, "unit": "score", "value": 57.25855944055944}, "RayTrace": {"lowerIsBetter": false, "filtered": 661.550166, "unit": "score", "value": 661.550166}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-053"}, "testrun": {"date": 1447300193, "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": "20151111173002", "branch": "Fx-Team", "revision": "5f9371f97e1e21f10fa20b39f33774116cfcf5f0"}}] 20:10:08 INFO - RETURN: dromaeo_css: 6935.24 20:10:08 INFO - RETURN: kraken: 1497.00 20:10:08 INFO - RETURN: v8_7: 21056.60 20:10:08 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,64,35]]", "result": "21056.60"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,64,35]]", "result": "1497.00"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,64,35]]", "result": "6935.24"}}} 20:10:08 INFO - Return code: 0 20:10:08 INFO - # TBPL SUCCESS # 20:10:08 INFO - Running post-action listener: _resource_record_post_action 20:10:08 INFO - Running post-run listener: _resource_record_post_run 20:10:09 INFO - Total resource usage - Wall time: 1229s; CPU: 13.0%; Read bytes: 16384; Write bytes: 265125888; Read time: 32; Write time: 122152 20:10:09 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 462848; Read time: 0; Write time: 56 20:10:09 INFO - run-tests - Wall time: 1215s; CPU: 13.0%; Read bytes: 16384; Write bytes: 260640768; Read time: 32; Write time: 121732 20:10:09 INFO - Running post-run listener: _upload_blobber_files 20:10:09 INFO - Blob upload gear active. 20:10:09 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 20:10:09 INFO - Copying logs to upload dir... 20:10:09 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1262.262917 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 2 secs) (at 2015-11-11 20:10:09.128236) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-11 20:10:09.132202) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test-pgo/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-pgo/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=919420d7ee4ef147bef0346300000385-1447297652.317436-549066302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009962 build_url: 'https://queue.taskcluster.net/v1/task/pCNvlfWfQ8SUJX-f7N7uEQ/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-11 20:10:09.184191) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 20:10:09.184559) ========= rm -f oauth.txt in dir /builds/slave/test-pgo/. (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-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=919420d7ee4ef147bef0346300000385-1447297652.317436-549066302 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004484 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-11 20:10:09.235009) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-11 20:10:09.235368) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-11 20:10:09.235696) ========= ========= Total master_lag: 0.20 =========