builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-035 starttime: 1447767143.3 results: success (0) buildid: 20151117030242 builduid: c1d8921f683d4290acceb8d8d0acf1d7 revision: 898c2c656e4b156c323416ef0c859915f3fd2308 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.299252) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.299691) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.300580) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006673 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.320771) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.321070) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.333837) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.334113) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004584 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.394352) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.394666) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.395020) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.395292) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-17 05:32:24-- 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% 46.9M=0s 2015-11-17 05:32:24 (46.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.096480 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.512172) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.512446) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022336 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.561444) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:23.561773) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 898c2c656e4b156c323416ef0c859915f3fd2308 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 898c2c656e4b156c323416ef0c859915f3fd2308 --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=0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-17 05:32:24,372 truncating revision to first 12 chars 2015-11-17 05:32:24,372 Setting DEBUG logging. 2015-11-17 05:32:24,372 attempt 1/10 2015-11-17 05:32:24,372 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/898c2c656e4b?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-17 05:32:24,752 unpacking tar archive at: mozilla-central-898c2c656e4b/testing/mozharness/ program finished with exit code 0 elapsedTime=0.698036 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:24.273670) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:24.273972) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:24.295434) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:24.295689) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:24.296072) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2015-11-17 05:32:24.296380) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 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', 'Firefox', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] 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=0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:32:25 INFO - MultiFileLogger online at 20151117 05:32:25 in /builds/slave/test-pgo 05:32:25 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 05:32:25 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 05:32:25 INFO - {'append_to_log': False, 05:32:25 INFO - 'base_work_dir': '/builds/slave/test-pgo', 05:32:25 INFO - 'blob_upload_branch': 'Firefox', 05:32:25 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 05:32:25 INFO - 'branch': 'Firefox', 05:32:25 INFO - 'buildbot_json_path': 'buildprops.json', 05:32:25 INFO - 'config_files': ('talos/linux_config.py',), 05:32:25 INFO - 'default_actions': ('clobber', 05:32:25 INFO - 'read-buildbot-config', 05:32:25 INFO - 'download-and-extract', 05:32:25 INFO - 'populate-webroot', 05:32:25 INFO - 'create-virtualenv', 05:32:25 INFO - 'install', 05:32:25 INFO - 'run-tests'), 05:32:25 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:32:25 INFO - 'download_minidump_stackwalk': True, 05:32:25 INFO - 'download_symbols': 'ondemand', 05:32:25 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:32:25 INFO - 'tooltool.py': '/tools/tooltool.py', 05:32:25 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:32:25 INFO - '/tools/misc-python/virtualenv.py')}, 05:32:25 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:32:25 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:32:25 INFO - 'installer_path': 'installer.exe', 05:32:25 INFO - 'log_level': 'info', 05:32:25 INFO - 'log_name': 'talos', 05:32:25 INFO - 'log_to_console': True, 05:32:25 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:32:25 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:32:25 INFO - 'opt_config_files': (), 05:32:25 INFO - 'pip_index': False, 05:32:25 INFO - 'sps_profile': False, 05:32:25 INFO - 'sps_profile_interval': 0, 05:32:25 INFO - 'suite': 'dromaeojs', 05:32:25 INFO - 'system_bits': '64', 05:32:25 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:32:25 INFO - 'title': 'talos-linux64-ix-035', 05:32:25 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:32:25 INFO - 'use_talos_json': True, 05:32:25 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 05:32:25 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:32:25 INFO - 'work_dir': 'build'} 05:32:25 INFO - ##### 05:32:25 INFO - ##### Running clobber step. 05:32:25 INFO - ##### 05:32:25 INFO - Running pre-action listener: _resource_record_pre_action 05:32:25 INFO - Running main action method: clobber 05:32:25 INFO - rmtree: /builds/slave/test-pgo/build 05:32:25 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 05:32:25 INFO - Running post-action listener: _resource_record_post_action 05:32:25 INFO - ##### 05:32:25 INFO - ##### Running read-buildbot-config step. 05:32:25 INFO - ##### 05:32:25 INFO - Running pre-action listener: _resource_record_pre_action 05:32:25 INFO - Running main action method: read_buildbot_config 05:32:25 INFO - Using buildbot properties: 05:32:25 INFO - { 05:32:25 INFO - "properties": { 05:32:25 INFO - "buildnumber": 562, 05:32:25 INFO - "product": "firefox", 05:32:25 INFO - "script_repo_revision": "production", 05:32:25 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 05:32:25 INFO - "repository": "", 05:32:25 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 05:32:25 INFO - "buildid": "20151117030242", 05:32:25 INFO - "slavename": "talos-linux64-ix-035", 05:32:25 INFO - "stage_platform": "linux64-pgo", 05:32:25 INFO - "basedir": "/builds/slave/test-pgo", 05:32:25 INFO - "nightly_build": "True", 05:32:25 INFO - "project": "", 05:32:25 INFO - "platform": "ubuntu64_hw", 05:32:25 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 05:32:25 INFO - "slavebuilddir": "test", 05:32:25 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 05:32:25 INFO - "branch": "mozilla-central", 05:32:25 INFO - "repo_path": "mozilla-central", 05:32:25 INFO - "pgo_build": "True", 05:32:25 INFO - "builduid": "c1d8921f683d4290acceb8d8d0acf1d7", 05:32:25 INFO - "revision": "898c2c656e4b156c323416ef0c859915f3fd2308" 05:32:25 INFO - }, 05:32:25 INFO - "sourcestamp": { 05:32:25 INFO - "repository": "", 05:32:25 INFO - "hasPatch": false, 05:32:25 INFO - "project": "", 05:32:25 INFO - "branch": "mozilla-central-linux64-pgo-talos", 05:32:25 INFO - "changes": [ 05:32:25 INFO - { 05:32:25 INFO - "category": null, 05:32:25 INFO - "files": [ 05:32:25 INFO - { 05:32:25 INFO - "url": null, 05:32:25 INFO - "name": "https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 05:32:25 INFO - } 05:32:25 INFO - ], 05:32:25 INFO - "repository": "", 05:32:25 INFO - "rev": "898c2c656e4b156c323416ef0c859915f3fd2308", 05:32:25 INFO - "who": "sendchange", 05:32:25 INFO - "when": 1447767080, 05:32:25 INFO - "number": 6671822, 05:32:25 INFO - "comments": "", 05:32:25 INFO - "project": "", 05:32:25 INFO - "at": "Tue 17 Nov 2015 05:31:20", 05:32:25 INFO - "branch": "mozilla-central-linux64-pgo-talos", 05:32:25 INFO - "revlink": "", 05:32:25 INFO - "properties": [ 05:32:25 INFO - [ 05:32:25 INFO - "buildid", 05:32:25 INFO - "20151117030242", 05:32:25 INFO - "Change" 05:32:25 INFO - ], 05:32:25 INFO - [ 05:32:25 INFO - "builduid", 05:32:25 INFO - "c1d8921f683d4290acceb8d8d0acf1d7", 05:32:25 INFO - "Change" 05:32:25 INFO - ], 05:32:25 INFO - [ 05:32:25 INFO - "nightly_build", 05:32:25 INFO - "True", 05:32:25 INFO - "Change" 05:32:25 INFO - ], 05:32:25 INFO - [ 05:32:25 INFO - "pgo_build", 05:32:25 INFO - "True", 05:32:25 INFO - "Change" 05:32:25 INFO - ] 05:32:25 INFO - ], 05:32:25 INFO - "revision": "898c2c656e4b156c323416ef0c859915f3fd2308" 05:32:25 INFO - } 05:32:25 INFO - ], 05:32:25 INFO - "revision": "898c2c656e4b156c323416ef0c859915f3fd2308" 05:32:25 INFO - } 05:32:25 INFO - } 05:32:25 INFO - Found installer url https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 05:32:25 INFO - Running post-action listener: _resource_record_post_action 05:32:25 INFO - ##### 05:32:25 INFO - ##### Running download-and-extract step. 05:32:25 INFO - ##### 05:32:25 INFO - Running pre-action listener: _resource_record_pre_action 05:32:25 INFO - Running main action method: download_and_extract 05:32:25 INFO - mkdir: /builds/slave/test-pgo/build/tests 05:32: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')]} 05:32:25 INFO - https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 05:32:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/test_packages.json 05:32:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/test_packages.json 05:32:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 05:32:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 05:32:26 INFO - Downloaded 1302 bytes. 05:32:26 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 05:32:26 INFO - Using the following test package requirements: 05:32:26 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 05:32:26 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:26 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:32:26 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:26 INFO - u'jsshell-linux-x86_64.zip'], 05:32:26 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:26 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:32:26 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 05:32:26 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:26 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:32:26 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:26 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:32:26 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:26 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:32:26 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 05:32:26 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:26 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:32:26 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:32:26 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')]} 05:32:26 INFO - https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:32:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:32:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:32:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/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 05:32:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/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 05:32:28 INFO - Downloaded 22463546 bytes. 05:32:28 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 05:32:28 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:32:28 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 05:32:29 INFO - Return code: 0 05:32:29 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 05:32:29 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')]} 05:32:29 INFO - https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 05:32:29 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:32:29 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:32:29 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/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 05:32:29 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/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 05:32:33 INFO - Downloaded 22463546 bytes. 05:32:33 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 05:32:33 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:32:33 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 05:32:34 INFO - Return code: 0 05:32: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')]} 05:32:34 INFO - https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 05:32:34 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 05:32:34 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 05:32:34 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/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 05:32:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/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 05:32:35 INFO - Downloaded 11131693 bytes. 05:32:35 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 05:32:35 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 05:32:35 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 05:32:35 INFO - Return code: 0 05:32:35 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')]} 05:32:35 INFO - https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 05:32:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 05:32:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 05:32:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/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 05:32:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/wzxk90-xS-yJadElX31mUw/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 05:32:37 INFO - Downloaded 57170979 bytes. 05:32:37 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 05:32:37 INFO - mkdir: /builds/slave/test-pgo/properties 05:32:37 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 05:32:37 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 05:32:37 INFO - Contents: 05:32:37 INFO - build_url:https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 05:32:37 INFO - Running post-action listener: _resource_record_post_action 05:32:37 INFO - Running post-action listener: set_extra_try_arguments 05:32:37 INFO - ##### 05:32:37 INFO - ##### Running populate-webroot step. 05:32:37 INFO - ##### 05:32:37 INFO - Running pre-action listener: _resource_record_pre_action 05:32:37 INFO - Running main action method: populate_webroot 05:32:37 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:32:37 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:32:37 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 05:32:37 INFO - '../fennec_ids.txt'], 05:32:37 INFO - 'tests': ['tcheck2']}, 05:32:37 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:32:37 INFO - '--tppagecycles', 05:32:37 INFO - '7'], 05:32:37 INFO - 'tests': ['tsvgm']}}, 05:32:37 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:32:37 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:32:37 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:32:37 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:32:37 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:32:37 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:32:37 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:37 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:32:37 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:37 INFO - 'talos_options': ['--e10s'], 05:32:37 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:32:37 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:37 INFO - 'tests': ['damp', 'tps']}, 05:32:37 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:37 INFO - 'talos_options': ['--e10s'], 05:32:37 INFO - 'tests': ['damp', 'tps']}, 05:32:37 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:32:37 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:32:37 INFO - 'other': {'tests': ['a11yr', 05:32:37 INFO - 'ts_paint', 05:32:37 INFO - 'tpaint', 05:32:37 INFO - 'sessionrestore', 05:32:37 INFO - 'sessionrestore_no_auto_restore']}, 05:32:37 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:32:37 INFO - 'tests': ['a11yr', 05:32:37 INFO - 'ts_paint', 05:32:37 INFO - 'tpaint', 05:32:37 INFO - 'sessionrestore', 05:32:37 INFO - 'sessionrestore_no_auto_restore']}, 05:32:37 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:32:37 INFO - 'tests': ['a11yr', 05:32:37 INFO - 'ts_paint', 05:32:37 INFO - 'tpaint', 05:32:37 INFO - 'sessionrestore', 05:32:37 INFO - 'sessionrestore_no_auto_restore']}, 05:32:37 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:32:37 INFO - 'tests': ['a11yr', 05:32:37 INFO - 'ts_paint', 05:32:37 INFO - 'tpaint', 05:32:37 INFO - 'sessionrestore', 05:32:37 INFO - 'sessionrestore_no_auto_restore']}, 05:32:37 INFO - 'other_l64': {'tests': ['a11yr', 05:32:37 INFO - 'ts_paint', 05:32:37 INFO - 'tpaint', 05:32:37 INFO - 'sessionrestore', 05:32:37 INFO - 'sessionrestore_no_auto_restore']}, 05:32:37 INFO - 'other_nol64': {'tests': ['a11yr', 05:32:37 INFO - 'ts_paint', 05:32:37 INFO - 'tpaint', 05:32:37 INFO - 'sessionrestore', 05:32:37 INFO - 'sessionrestore_no_auto_restore']}, 05:32:37 INFO - 'svgr': {'tests': ['tsvgx', 05:32:37 INFO - 'tsvgr_opacity', 05:32:37 INFO - 'tart', 05:32:37 INFO - 'tscrollx', 05:32:37 INFO - 'cart']}, 05:32:37 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:32:37 INFO - 'tests': ['tsvgx', 05:32:37 INFO - 'tsvgr_opacity', 05:32:37 INFO - 'tart', 05:32:37 INFO - 'tscrollx', 05:32:37 INFO - 'cart']}, 05:32:37 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:37 INFO - 'tests': ['tp5o']}, 05:32:37 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:37 INFO - 'talos_options': ['--e10s'], 05:32:37 INFO - 'tests': ['tp5o']}, 05:32:37 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:37 INFO - 'talos_options': ['--xperf_path', 05:32:37 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:32:37 INFO - 'tests': ['tp5n']}, 05:32:37 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:37 INFO - 'talos_options': ['--e10s', 05:32:37 INFO - '--xperf_path', 05:32:37 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:32:37 INFO - 'tests': ['tp5n']}}, 05:32:37 INFO - 'talos.zip': {'path': '', 05:32:37 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:32:37 INFO - Running post-action listener: _resource_record_post_action 05:32:37 INFO - ##### 05:32:37 INFO - ##### Running create-virtualenv step. 05:32:37 INFO - ##### 05:32:37 INFO - Running pre-action listener: _resource_record_pre_action 05:32:37 INFO - Running main action method: create_virtualenv 05:32:37 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 05:32:37 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 05:32:37 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 05:32:37 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:32:37 INFO - Using real prefix '/usr' 05:32:37 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 05:32:38 INFO - Installing distribute.............................................................................................................................................................................................done. 05:32:40 INFO - Installing pip.................done. 05:32:40 INFO - Return code: 0 05:32:40 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 05:32:40 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')]} 05:32:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:40 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')]} 05:32:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:40 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 0x7f171aee3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10cc6e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1102a90>, '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 0x1154f70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11552e0>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', '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 05:32:40 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 05:32:40 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 05:32:40 INFO - Using env: {'DISPLAY': ':0', 05:32:40 INFO - 'HOME': '/home/cltbld', 05:32:40 INFO - 'LANG': 'en_US.UTF-8', 05:32:40 INFO - 'LANGUAGE': 'en_US:en', 05:32:40 INFO - 'LOGNAME': 'cltbld', 05:32:40 INFO - 'MAIL': '/var/mail/cltbld', 05:32:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:40 INFO - 'MOZ_NO_REMOTE': '1', 05:32:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:40 INFO - 'NO_EM_RESTART': '1', 05:32:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:40 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:40 INFO - 'SHELL': '/bin/bash', 05:32:40 INFO - 'SHLVL': '1', 05:32:40 INFO - 'TERM': 'linux', 05:32:40 INFO - 'TMOUT': '86400', 05:32:40 INFO - 'USER': 'cltbld', 05:32:40 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', 05:32:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:40 INFO - '_': '/tools/buildbot/bin/python'} 05:32:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:40 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 05:32:40 INFO - Cleaning up... 05:32:40 INFO - Return code: 0 05:32:40 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 05:32:40 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')]} 05:32:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:40 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')]} 05:32:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:40 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 0x7f171aee3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10cc6e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1102a90>, '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 0x1154f70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11552e0>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', '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 05:32:40 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 05:32:40 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 05:32:40 INFO - Using env: {'DISPLAY': ':0', 05:32:40 INFO - 'HOME': '/home/cltbld', 05:32:40 INFO - 'LANG': 'en_US.UTF-8', 05:32:40 INFO - 'LANGUAGE': 'en_US:en', 05:32:40 INFO - 'LOGNAME': 'cltbld', 05:32:40 INFO - 'MAIL': '/var/mail/cltbld', 05:32:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:40 INFO - 'MOZ_NO_REMOTE': '1', 05:32:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:40 INFO - 'NO_EM_RESTART': '1', 05:32:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:40 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:40 INFO - 'SHELL': '/bin/bash', 05:32:40 INFO - 'SHLVL': '1', 05:32:40 INFO - 'TERM': 'linux', 05:32:40 INFO - 'TMOUT': '86400', 05:32:40 INFO - 'USER': 'cltbld', 05:32:40 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', 05:32:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:40 INFO - '_': '/tools/buildbot/bin/python'} 05:32:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:40 INFO - Downloading/unpacking psutil>=0.7.1 05:32:40 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 05:32:40 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 05:32:40 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 05:32:40 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 05:32:40 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 05:32:40 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 05:32:42 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 05:32:42 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 05:32:42 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 05:32:42 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:32:42 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:32:42 INFO - Installing collected packages: psutil 05:32:42 INFO - Running setup.py install for psutil 05:32:42 INFO - building 'psutil._psutil_linux' extension 05:32:42 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 05:32:42 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 05:32:42 INFO - building 'psutil._psutil_posix' extension 05:32:42 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 05:32:42 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 05:32:42 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:32:42 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:32:42 INFO - Successfully installed psutil 05:32:42 INFO - Cleaning up... 05:32:43 INFO - Return code: 0 05:32:43 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 05:32:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:43 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 0x7f171aee3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10cc6e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1102a90>, '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 0x1154f70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11552e0>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', '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 05:32:43 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 05:32:43 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 05:32:43 INFO - Using env: {'DISPLAY': ':0', 05:32:43 INFO - 'HOME': '/home/cltbld', 05:32:43 INFO - 'LANG': 'en_US.UTF-8', 05:32:43 INFO - 'LANGUAGE': 'en_US:en', 05:32:43 INFO - 'LOGNAME': 'cltbld', 05:32:43 INFO - 'MAIL': '/var/mail/cltbld', 05:32:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:43 INFO - 'MOZ_NO_REMOTE': '1', 05:32:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:43 INFO - 'NO_EM_RESTART': '1', 05:32:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:43 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:43 INFO - 'SHELL': '/bin/bash', 05:32:43 INFO - 'SHLVL': '1', 05:32:43 INFO - 'TERM': 'linux', 05:32:43 INFO - 'TMOUT': '86400', 05:32:43 INFO - 'USER': 'cltbld', 05:32:43 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', 05:32:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:43 INFO - '_': '/tools/buildbot/bin/python'} 05:32:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:43 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:32:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:44 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:32:44 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 05:32:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:32:44 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 05:32:44 INFO - Installing collected packages: mozsystemmonitor 05:32:44 INFO - Running setup.py install for mozsystemmonitor 05:32:45 INFO - Successfully installed mozsystemmonitor 05:32:45 INFO - Cleaning up... 05:32:45 INFO - Return code: 0 05:32:45 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 05:32:45 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')]} 05:32:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:45 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')]} 05:32:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:45 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 0x7f171aee3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10cc6e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1102a90>, '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 0x1154f70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11552e0>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', '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 05:32:45 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 05:32:45 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 05:32:45 INFO - Using env: {'DISPLAY': ':0', 05:32:45 INFO - 'HOME': '/home/cltbld', 05:32:45 INFO - 'LANG': 'en_US.UTF-8', 05:32:45 INFO - 'LANGUAGE': 'en_US:en', 05:32:45 INFO - 'LOGNAME': 'cltbld', 05:32:45 INFO - 'MAIL': '/var/mail/cltbld', 05:32:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:45 INFO - 'MOZ_NO_REMOTE': '1', 05:32:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:45 INFO - 'NO_EM_RESTART': '1', 05:32:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:45 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:45 INFO - 'SHELL': '/bin/bash', 05:32:45 INFO - 'SHLVL': '1', 05:32:45 INFO - 'TERM': 'linux', 05:32:45 INFO - 'TMOUT': '86400', 05:32:45 INFO - 'USER': 'cltbld', 05:32:45 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', 05:32:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:45 INFO - '_': '/tools/buildbot/bin/python'} 05:32:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:45 INFO - Downloading/unpacking blobuploader==1.2.4 05:32:45 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 05:32:45 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 05:32:45 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 05:32:45 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 05:32:45 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 05:32:45 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 05:32:46 INFO - Downloading blobuploader-1.2.4.tar.gz 05:32:46 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 05:32:46 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:32:47 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:32:47 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 05:32:47 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 05:32:47 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 05:32:47 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 05:32:47 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 05:32:47 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 05:32:47 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 05:32:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 05:32:47 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:32:47 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 05:32:47 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 05:32:47 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 05:32:47 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 05:32:47 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 05:32:47 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 05:32:47 INFO - Downloading docopt-0.6.1.tar.gz 05:32:47 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 05:32:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 05:32:47 INFO - Installing collected packages: blobuploader, requests, docopt 05:32:47 INFO - Running setup.py install for blobuploader 05:32:47 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:32:47 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 05:32:47 INFO - Running setup.py install for requests 05:32:48 INFO - Running setup.py install for docopt 05:32:48 INFO - Successfully installed blobuploader requests docopt 05:32:48 INFO - Cleaning up... 05:32:48 INFO - Return code: 0 05:32:48 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:32:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:48 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 0x7f171aee3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10cc6e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1102a90>, '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 0x1154f70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11552e0>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', '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 05:32:48 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 05:32:48 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 05:32:48 INFO - Using env: {'DISPLAY': ':0', 05:32:48 INFO - 'HOME': '/home/cltbld', 05:32:48 INFO - 'LANG': 'en_US.UTF-8', 05:32:48 INFO - 'LANGUAGE': 'en_US:en', 05:32:48 INFO - 'LOGNAME': 'cltbld', 05:32:48 INFO - 'MAIL': '/var/mail/cltbld', 05:32:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:48 INFO - 'MOZ_NO_REMOTE': '1', 05:32:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:48 INFO - 'NO_EM_RESTART': '1', 05:32:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:48 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:48 INFO - 'SHELL': '/bin/bash', 05:32:48 INFO - 'SHLVL': '1', 05:32:48 INFO - 'TERM': 'linux', 05:32:48 INFO - 'TMOUT': '86400', 05:32:48 INFO - 'USER': 'cltbld', 05:32:48 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', 05:32:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:48 INFO - '_': '/tools/buildbot/bin/python'} 05:32:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:32:48 INFO - Running setup.py (path:/tmp/pip-QD7cu9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:32:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:32:48 INFO - Running setup.py (path:/tmp/pip-jwNLLs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:32:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:32:48 INFO - Running setup.py (path:/tmp/pip-2cQezq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:32:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:32:48 INFO - Running setup.py (path:/tmp/pip-3u_qcR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:32:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:32:48 INFO - Running setup.py (path:/tmp/pip-aeDxpo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:32:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:32:48 INFO - Running setup.py (path:/tmp/pip-aGiKwo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:32:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:32:48 INFO - Running setup.py (path:/tmp/pip-mGJ0m1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:32:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:32:48 INFO - Running setup.py (path:/tmp/pip-WzBK45-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:32:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:32:49 INFO - Running setup.py (path:/tmp/pip-I8oYlM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:32:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:32:49 INFO - Running setup.py (path:/tmp/pip-_6Uu6v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:32:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:32:49 INFO - Running setup.py (path:/tmp/pip-ruYU2i-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:32:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:32:49 INFO - Running setup.py (path:/tmp/pip-b7AAlF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:32:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:32:49 INFO - Running setup.py (path:/tmp/pip-RVzQux-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:32:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:32:49 INFO - Running setup.py (path:/tmp/pip-hzMvK2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:32:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:32:49 INFO - Running setup.py (path:/tmp/pip-Mkmqjl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:32:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:32:49 INFO - Running setup.py (path:/tmp/pip-28DzUb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:32:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:32:49 INFO - Running setup.py (path:/tmp/pip-wz79c6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:32:49 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:32:49 INFO - Running setup.py install for manifestparser 05:32:49 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 05:32:49 INFO - Running setup.py install for mozcrash 05:32:49 INFO - Running setup.py install for mozdebug 05:32:49 INFO - Running setup.py install for mozdevice 05:32:50 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Running setup.py install for mozfile 05:32:50 INFO - Running setup.py install for mozhttpd 05:32:50 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Running setup.py install for mozinfo 05:32:50 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Running setup.py install for mozInstall 05:32:50 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Running setup.py install for mozleak 05:32:50 INFO - Running setup.py install for mozlog 05:32:50 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Running setup.py install for moznetwork 05:32:50 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 05:32:50 INFO - Running setup.py install for mozprocess 05:32:50 INFO - Running setup.py install for mozprofile 05:32:51 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 05:32:51 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 05:32:51 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 05:32:51 INFO - Running setup.py install for mozrunner 05:32:51 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 05:32:51 INFO - Running setup.py install for mozscreenshot 05:32:51 INFO - Running setup.py install for moztest 05:32:51 INFO - Running setup.py install for mozversion 05:32:51 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 05:32:51 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:32:51 INFO - Cleaning up... 05:32:51 INFO - Return code: 0 05:32:51 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:32:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:51 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 0x7f171aee3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10cc6e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1102a90>, '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 0x1154f70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11552e0>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', '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 05:32:51 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 05:32:51 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 05:32:51 INFO - Using env: {'DISPLAY': ':0', 05:32:51 INFO - 'HOME': '/home/cltbld', 05:32:51 INFO - 'LANG': 'en_US.UTF-8', 05:32:51 INFO - 'LANGUAGE': 'en_US:en', 05:32:51 INFO - 'LOGNAME': 'cltbld', 05:32:51 INFO - 'MAIL': '/var/mail/cltbld', 05:32:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:51 INFO - 'MOZ_NO_REMOTE': '1', 05:32:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:51 INFO - 'NO_EM_RESTART': '1', 05:32:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:51 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:51 INFO - 'SHELL': '/bin/bash', 05:32:51 INFO - 'SHLVL': '1', 05:32:51 INFO - 'TERM': 'linux', 05:32:51 INFO - 'TMOUT': '86400', 05:32:51 INFO - 'USER': 'cltbld', 05:32:51 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', 05:32:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:51 INFO - '_': '/tools/buildbot/bin/python'} 05:32:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:32:51 INFO - Running setup.py (path:/tmp/pip-at8IVu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:32:51 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)) 05:32:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:32:51 INFO - Running setup.py (path:/tmp/pip-ygoTqY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:32:51 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)) 05:32:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:32:51 INFO - Running setup.py (path:/tmp/pip-HFq9cw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:32:51 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)) 05:32:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:32:51 INFO - Running setup.py (path:/tmp/pip-SqCtBy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:32:51 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)) 05:32:51 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:32:51 INFO - Running setup.py (path:/tmp/pip-q4BXFe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:32:52 INFO - Running setup.py (path:/tmp/pip-5p8gdo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:32:52 INFO - Running setup.py (path:/tmp/pip-f6X5x1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:32:52 INFO - Running setup.py (path:/tmp/pip-vuGxWj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:32:52 INFO - Running setup.py (path:/tmp/pip-F9QNsA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:32:52 INFO - Running setup.py (path:/tmp/pip-WNqQgR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:32:52 INFO - Running setup.py (path:/tmp/pip-N_Dm7u-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:32:52 INFO - Running setup.py (path:/tmp/pip-qFWvM5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:32:52 INFO - Running setup.py (path:/tmp/pip-VOg9Xd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:32:52 INFO - Running setup.py (path:/tmp/pip-KXypda-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:32:52 INFO - Running setup.py (path:/tmp/pip-sY882N-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:32:52 INFO - Running setup.py (path:/tmp/pip-36X4PU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:32:52 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)) 05:32:52 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:32:52 INFO - Running setup.py (path:/tmp/pip-YwcvfU-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:32:52 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)) 05:32:52 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)) 05:32:52 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)) 05:32:52 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)) 05:32:52 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)) 05:32:52 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)) 05:32:52 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 05:32:52 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 05:32:52 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 05:32:52 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 05:32:52 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 05:32:52 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 05:32:52 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 05:32:54 INFO - Downloading blessings-1.5.1.tar.gz 05:32:54 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 05:32:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 05:32:54 INFO - Installing collected packages: blessings 05:32:54 INFO - Running setup.py install for blessings 05:32:54 INFO - Successfully installed blessings 05:32:54 INFO - Cleaning up... 05:32:54 INFO - Return code: 0 05:32:54 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 05:32:54 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:32:54 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:32:55 INFO - Reading from file tmpfile_stdout 05:32:55 INFO - Current package versions: 05:32:55 INFO - argparse == 1.2.1 05:32:55 INFO - blessings == 1.5.1 05:32:55 INFO - blobuploader == 1.2.4 05:32:55 INFO - docopt == 0.6.1 05:32:55 INFO - manifestparser == 1.1 05:32:55 INFO - mozInstall == 1.12 05:32:55 INFO - mozcrash == 0.16 05:32:55 INFO - mozdebug == 0.1 05:32:55 INFO - mozdevice == 0.47 05:32:55 INFO - mozfile == 1.2 05:32:55 INFO - mozhttpd == 0.7 05:32:55 INFO - mozinfo == 0.9 05:32:55 INFO - mozleak == 0.1 05:32:55 INFO - mozlog == 3.0 05:32:55 INFO - moznetwork == 0.27 05:32:55 INFO - mozprocess == 0.22 05:32:55 INFO - mozprofile == 0.27 05:32:55 INFO - mozrunner == 6.11 05:32:55 INFO - mozscreenshot == 0.1 05:32:55 INFO - mozsystemmonitor == 0.0 05:32:55 INFO - moztest == 0.7 05:32:55 INFO - mozversion == 1.4 05:32:55 INFO - psutil == 3.1.1 05:32:55 INFO - requests == 1.2.3 05:32:55 INFO - wsgiref == 0.1.2 05:32:55 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:32:55 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')]} 05:32:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:55 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')]} 05:32:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:55 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 0x7f171aee3c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x100b6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10cc6e0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1102a90>, '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 0x1154f70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11552e0>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', '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 05:32:55 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 05:32:55 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 05:32:55 INFO - Using env: {'DISPLAY': ':0', 05:32:55 INFO - 'HOME': '/home/cltbld', 05:32:55 INFO - 'LANG': 'en_US.UTF-8', 05:32:55 INFO - 'LANGUAGE': 'en_US:en', 05:32:55 INFO - 'LOGNAME': 'cltbld', 05:32:55 INFO - 'MAIL': '/var/mail/cltbld', 05:32:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:55 INFO - 'MOZ_NO_REMOTE': '1', 05:32:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:55 INFO - 'NO_EM_RESTART': '1', 05:32:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:55 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:55 INFO - 'SHELL': '/bin/bash', 05:32:55 INFO - 'SHLVL': '1', 05:32:55 INFO - 'TERM': 'linux', 05:32:55 INFO - 'TMOUT': '86400', 05:32:55 INFO - 'USER': 'cltbld', 05:32:55 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', 05:32:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:55 INFO - '_': '/tools/buildbot/bin/python'} 05:32:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:55 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)) 05:32:55 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)) 05:32:55 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)) 05:32:55 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)) 05:32:55 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)) 05:32:55 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)) 05:32:55 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)) 05:32:55 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)) 05:32:55 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)) 05:32:55 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)) 05:32:55 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)) 05:32:55 INFO - Cleaning up... 05:32:55 INFO - Return code: 0 05:32:55 INFO - Running post-action listener: _resource_record_post_action 05:32:55 INFO - Running post-action listener: _start_resource_monitoring 05:32:55 INFO - Starting resource monitoring. 05:32:55 INFO - ##### 05:32:55 INFO - ##### Running install step. 05:32:55 INFO - ##### 05:32:55 INFO - Running pre-action listener: _resource_record_pre_action 05:32:55 INFO - Running main action method: install 05:32:55 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:32:55 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:32:55 INFO - Reading from file tmpfile_stdout 05:32:55 INFO - Detecting whether we're running mozinstall >=1.0... 05:32:55 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 05:32:55 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 05:32:55 INFO - Reading from file tmpfile_stdout 05:32:55 INFO - Output received: 05:32:55 INFO - Usage: mozinstall [options] installer 05:32:55 INFO - Options: 05:32:55 INFO - -h, --help show this help message and exit 05:32:55 INFO - -d DEST, --destination=DEST 05:32:55 INFO - Directory to install application into. [default: 05:32:55 INFO - "/builds/slave/test-pgo"] 05:32:55 INFO - --app=APP Application being installed. [default: firefox] 05:32:55 INFO - mkdir: /builds/slave/test-pgo/build/application 05:32:55 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'] 05:32:55 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 05:33:09 INFO - Reading from file tmpfile_stdout 05:33:09 INFO - Output received: 05:33:09 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 05:33:09 INFO - Running post-action listener: _resource_record_post_action 05:33:09 INFO - ##### 05:33:09 INFO - ##### Running run-tests step. 05:33:09 INFO - ##### 05:33:09 INFO - Running pre-action listener: _resource_record_pre_action 05:33:09 INFO - Running main action method: run_tests 05:33:09 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 05:33:09 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 05:33:10 INFO - Python 2.7.3 05:33:10 INFO - Return code: 0 05:33:10 INFO - grabbing minidump binary from tooltool 05:33:10 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')]} 05:33:10 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 0x1102a90>, '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 0x1154f70>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11552e0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 05:33:10 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 05:33:10 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 05:33:10 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:33:10 INFO - Return code: 0 05:33:10 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 05:33:10 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 05:33:10 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 05:33:10 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 05:33:10 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 05:33:10 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-035', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 05:33:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --debug --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-035 --webServer localhost 05:33:10 INFO - Using env: {'DISPLAY': ':0', 05:33:10 INFO - 'HOME': '/home/cltbld', 05:33:10 INFO - 'LANG': 'en_US.UTF-8', 05:33:10 INFO - 'LANGUAGE': 'en_US:en', 05:33:10 INFO - 'LOGNAME': 'cltbld', 05:33:10 INFO - 'MAIL': '/var/mail/cltbld', 05:33:10 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:33:10 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 05:33:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:33:10 INFO - 'MOZ_NO_REMOTE': '1', 05:33:10 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:33:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:33:10 INFO - 'NO_EM_RESTART': '1', 05:33:10 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:33:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:33:10 INFO - 'PWD': '/builds/slave/test-pgo', 05:33:10 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 05:33:10 INFO - 'SHELL': '/bin/bash', 05:33:10 INFO - 'SHLVL': '1', 05:33:10 INFO - 'TERM': 'linux', 05:33:10 INFO - 'TMOUT': '86400', 05:33:10 INFO - 'USER': 'cltbld', 05:33:10 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110', 05:33:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:33:10 INFO - '_': '/tools/buildbot/bin/python'} 05:33:10 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-035', '--webServer', 'localhost'] with output_timeout 3600 05:33:10 INFO - mozversion INFO | application_buildid: 20151117030242 05:33:10 INFO - mozversion INFO | application_changeset: 898c2c656e4b156c323416ef0c859915f3fd2308 05:33:10 INFO - mozversion INFO | application_display_name: Nightly 05:33:10 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:33:10 INFO - mozversion INFO | application_name: Firefox 05:33:10 INFO - mozversion INFO | application_remotingname: firefox 05:33:10 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/mozilla-central 05:33:10 INFO - mozversion INFO | application_vendor: Mozilla 05:33:10 INFO - mozversion INFO | application_version: 45.0a1 05:33:10 INFO - mozversion INFO | platform_buildid: 20151117030242 05:33:10 INFO - mozversion INFO | platform_changeset: 898c2c656e4b156c323416ef0c859915f3fd2308 05:33:10 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/mozilla-central 05:33:10 INFO - mozversion INFO | platform_version: 45.0a1 05:33:10 INFO - 2015-11-17 05:33:10,344 DEBUG : using testdate: 1447767190 05:33:10 INFO - 2015-11-17 05:33:10,344 DEBUG : actual date: 1447767190 05:33:10 INFO - 2015-11-17 05:33:10,391 INFO : starting webserver on 'localhost:39819' 05:33:10 INFO - 2015-11-17 05:33:10,392 INFO : Starting test suite talos-linux64-ix-035 05:33:10 INFO - 2015-11-17 05:33:10,392 INFO : Starting test dromaeo_css 05:33:10 INFO - 2015-11-17 05:33:10,393 DEBUG : operating with platform_type : linux_ 05:33:10 INFO - 2015-11-17 05:33:10,393 INFO : Initialising browser for dromaeo_css test... 05:33:10 INFO - 2015-11-17 05:33:10,402 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpk7J6zv/profile http://localhost:39819/getInfo.html 05:33:14 INFO - 2015-11-17 05:33:14,445 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:33:14 INFO - 2015-11-17 05:33:14,445 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:33:14 INFO - 2015-11-17 05:33:14,445 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:33:14 INFO - 2015-11-17 05:33:14,445 DEBUG : BROWSER_OUTPUT: __metrics 05:33:14 INFO - 2015-11-17 05:33:14,582 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:33:15 INFO - 2015-11-17 05:33:15,620 INFO : Browser initialized. 05:33:15 INFO - 2015-11-17 05:33:15,621 INFO : Running cycle 1/1 for dromaeo_css test... 05:33:15 INFO - 2015-11-17 05:33:15,621 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpk7J6zv/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:33:27 INFO - 2015-11-17 05:33:27,422 DEBUG : BROWSER_OUTPUT: RSS: Main: 141975552 05:33:27 INFO - 2015-11-17 05:33:27,423 DEBUG : BROWSER_OUTPUT: 05:34:19 INFO - 2015-11-17 05:34:19,077 DEBUG : BROWSER_OUTPUT: 1447767259070 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 05:36:27 INFO - 2015-11-17 05:36:27,791 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39819/tests/dromaeo/cssquery-ext.html) 05:36:28 INFO - 2015-11-17 05:36:28,821 DEBUG : BROWSER_OUTPUT: RSS: Main: 235741184 05:36:28 INFO - 2015-11-17 05:36:28,821 DEBUG : BROWSER_OUTPUT: 05:39:31 INFO - 2015-11-17 05:39:31,017 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/dromaeo/cssquery-ext.html (next: http://localhost:39819/tests/dromaeo/cssquery-jquery.html) 05:39:31 INFO - 2015-11-17 05:39:31,583 DEBUG : BROWSER_OUTPUT: RSS: Main: 216002560 05:39:31 INFO - 2015-11-17 05:39:31,583 DEBUG : BROWSER_OUTPUT: 05:42:33 INFO - 2015-11-17 05:42:33,472 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39819/tests/dromaeo/cssquery-mootools.html) 05:42:34 INFO - 2015-11-17 05:42:34,041 DEBUG : BROWSER_OUTPUT: RSS: Main: 215392256 05:42:34 INFO - 2015-11-17 05:42:34,041 DEBUG : BROWSER_OUTPUT: 05:45:35 INFO - 2015-11-17 05:45:35,892 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39819/tests/dromaeo/cssquery-prototype.html) 05:45:36 INFO - 2015-11-17 05:45:36,458 DEBUG : BROWSER_OUTPUT: RSS: Main: 196313088 05:45:36 INFO - 2015-11-17 05:45:36,458 DEBUG : BROWSER_OUTPUT: 05:48:38 INFO - 2015-11-17 05:48:38,962 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39819/tests/dromaeo/cssquery-yui.html) 05:48:39 INFO - 2015-11-17 05:48:39,522 DEBUG : BROWSER_OUTPUT: RSS: Main: 204791808 05:48:39 INFO - 2015-11-17 05:48:39,523 DEBUG : BROWSER_OUTPUT: 05:51:41 INFO - 2015-11-17 05:51:41,887 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/dromaeo/cssquery-yui.html (next: http://localhost:39819/tests/dromaeo/cssquery-dojo.html) 05:51:42 INFO - 2015-11-17 05:51:42,145 DEBUG : BROWSER_OUTPUT: RSS: Main: 272572416 05:51:42 INFO - 2015-11-17 05:51:42,145 DEBUG : BROWSER_OUTPUT: 05:51:42 INFO - 2015-11-17 05:51:42,145 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:51:42 INFO - 2015-11-17 05:51:42,145 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:51:42 INFO - 2015-11-17 05:51:42,145 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:51:42 INFO - 2015-11-17 05:51:42,145 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:51:42 INFO - 2015-11-17 05:51:42,145 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3186.856591453384;3240.4005259027094;3270.3132342208137;3287.5233091201776;3303.042117785842;5277.577793776498;5377.139657654776;5399.595030372718;5407.567394608432;5440.761407927683;5359.30329057223;5394.136938089907;5403.83788486346;5411.702356370398;5430.5384042356445;4930.827421040264;4969.527894849993;5027.748612569375;5140.742962851861;5150.845474635767;4893.926591101136;5072.960043191156;5114.667546609477;5134.1528647773075;5167.302414174076;4824.734639594839;4895.681780684244;4923.433805112422;4964.776585053682;4976.278439626252;4858.514148585148;4870.07468580972;4874.512548745132;4895.755212239374;4909.165441874889;4740.786664600101;4860.1737704590305;4870.829520966785;4903.705777653352;4918.803247870081;5063.8480845574695;5138.177891537336;5157.07172708916;5162.354705661793;5184;5783.710814459302;5784.768609255625;5785.53715702747;5787.392323806024;5790.073588225906;5707.058335374658;5783.652980821164;5788.04497257952;5803.390643982363;5872.031114866042;5427.6472029317965;5492.066348720727;5493.807716729895;5495.368032676213;5499.065158922993;5965.045592705146;5966.31387390447;5986.191864098378;5990.610610310316;5996.730147143389;5711.628744131618;5745.454181852718;5796;5809.331926828384;5827.825165245049;5975.073863551156;5977.521798256129;5977.880442391128;5989.580729348903;6006.189164462829;5932.0508718604815;5934.080217566284;5934.43622855828;5935.258092738408;5939.287285525678;5629.605927585029;5732.398098199712;5735.741891614887;5761.971190144106;5874.236349274653;4503.662225333113;4508.346289787963;4509.526499717483;4537.886552836139;4548.363229147922;3985.860494882665;3990.38149086892;4005.9599404005585;4025.6175663311938;4064.2684316822665;5428.4842939920645;5517.944820551824;5561.749721262553;5585.720713964285;5606.187102870061;5894.056950887837;5921;5921.437463440966;5926.140709597084;5929.14027466015;5598.664080155204;5600.131979543177;5600.299962504687;5600.439956004367;5606.074997625346;4932.358793356841;5027.044861476308;5053.69677819332;5087.3386459759995;5125.205593133071;6046.546509011841;6116.480099191618;6119.632822030692;6129.11127886454;6129.570930034854;5719.399463056319;5928.525717942468;5948.910766338422;5950.9404905952115;5956.76172953077;5870.823875283749;5961.254843144607;5963.701814909324;5968.522518198447;6009.789657361971;5797.391273916178;5807.390224026585;5814.592978491465;5816.214811000461;5817.040188368872;5807.419258074159;5853.326867410302;5867.882642347044;5871.794487193099;5919.822405327847;5677.432256774289;5750.971245143747;5751.281089863767;5755.597108202385;5757.481826635623;5713.028785106459;5726.198332233574;5728.885422291614;5731.942680573141;5732.484076433141;5560;5587.720613969366;5635.0702134147405;5647.971760141338;5682.232898558642;5872.060470324727;5885.94114058871;5891.23413956183;5899.439553242435;5939.703014849327;5750.741216645345;5751.568632352674;5760.423957604206;5761.971190144022;5764.510016648632 05:51:42 INFO - 2015-11-17 05:51:42,146 DEBUG : BROWSER_OUTPUT: |1;ext.html;568.9374168841426;600.603601622929;612.4212619074971;613.0711971363385;617.9783707570234;31960.68039319606;32545.67454325456;39214.60785392145;39247;39263.41104883429;42686.35970460445;43190.35214471786;43226.7838660807;43229.35155972663;43260.56739432605;7613.885791713129;8698.782530436742;8867.955660221689;8870.86693699595;8872.245859101984;7653.732119375823;7785.455018148732;10447.791044179112;10680.145588352952;10681.83977240342;10396;10457.267991240617;10505.894941050607;10515.52680129396;10531.368117912949;10395.804482484498;10412.062914337708;10436.112930400925;10483.73790655232;10510.684679459628;10280.280380373377;10330.225233107472;10349.58601655933;10411.010953959438;10412.32319899204;40800.59199408027;41316.76049718513;41321.38017929703;41338;41374.79312603418;3446.844891979867;3476.1483436558206;3514.578250609943;3718.1076541629814;4018.5177778666457;29205.70794292051;29624;29688.257793555335;29796.702032979825;29977;3536.5579302587175;3612.151144481045;3645.6172101929446;3651.72612054097;3697.9815100924593;270908;272143;272508;272882;274150.62924685446;60628;61024.69487652622;61063;61091.38908610946;61144.69427652833;65496.67251663711;65609.34390656128;65623;65624;65637.34362656408;15121.924390378197;15249.695006100037;15289.159096249814;15299.923500382427;15307.15810630426;11789.292642441482;11817.822732659017;11849.763004740029;11856.466459009365;11862.110341724232;19433.31983380575;20495.28266510665;20537.17851285932;20591.8970405147;20656.380308590768;6332.493400528039;8033.277005069572;8132;8395.875465008765;8563.614637341334;941.3457646935315;949.2880339745191;953.1755031897359;1031.4739482863793;1134.5348407153028;28069.859650702023;28131.296717582223;28777.280567985967;28823.85588072046;28850.27874303159;1050.464263225745;1058.5342449322275;1082.2532452607675;1126.6957921361186;1127.656064900197;16601.91699041497;17364.305427783;17386.4784056476;17403.390881319094;17426.302947882195;400193;404194;433034;438356;684449;54700.726496367264;55088;55374.44625553773;55417.44582554203;55463.72268138634;1345.7577636025414;1348.7504811609883;1349.8582648821928;1352.7024054708145;1363.5227670315508;27249.727502725513;32597.18507037248;32632.510512341858;32716.345673086882;33081;48929.2660610084;49502.257466137315;49520.50479495159;49592.75203623959;49620;301176;302964;303640;304120;304364;31489;32602.184945376557;32617;32647.673523264464;32649;42551;42824.78587607042;42889.78555107205;43750.34374484449;43812.561874380845;36501.45247821232;36896.44655330118;36995.63004369922;37084.6291537092;37646.62353376541;37034.629653703116;40887.591124089566;41406;42440.36339454973;43575;40443;40491.98770030773;40662.593374067066;40729.796351018056;41566.58433415627;30991.380172396875;31141;32862.83568582142;33717;34032.48951265783;26505.469890601693;28211.71788282091;28275.293117672223;28428.289292767848;28472.715272847006 05:51:42 INFO - 2015-11-17 05:51:42,146 DEBUG : BROWSER_OUTPUT: |2;jquery.html;331.60538958639205;344.36808456482356;345.3389197957823;347.6054677940538;348.2860136719724;14405.783913241283;14716.55850324492;16696.666066678674;16917.661646767072;17871.82128178718;16101.677966440664;16141.11223882686;16312.347506099743;16687.415940442086;16696;5143.562797162245;5259.158534634459;5272.710000949965;5275.971185618806;5281.260623512711;3916.295066887959;4017.799110044486;5238.973805130988;5743.597948143632;5936.168936348915;5805.158252053449;5825.097109947965;5832.883342333172;5841.357450680422;5860.355360910296;5687.630304030225;5872.853178670524;5875.030619947704;5876.11858221266;5879.706014699269;5136.126858434075;5144.099782538041;5145.2024936134585;5152.716600586966;5163.561097306733;13005.349732513336;13149.145305555205;13387.732245355039;13400.664983375396;13420.463181472729;1906.4185423445842;2063.267540023285;2109.7679255281905;2167.5231449081175;2513.5978243481136;10056.29605927578;10079.647212347605;10263.538140783683;10373.170146388271;10399.688009359732;1704.8039475460357;1715.4339068107495;1724.6033412315112;1739.6781595404764;1771.6102457459338;60711.411073615796;61063.38936610666;61783.38216617821;62466.37533624651;62899.685501572196;7047.295270472911;7079.893801592877;7103.183133939559;7145.249748776408;7183.42532597391;8533.74398768038;8599.226069653761;8600.268977137013;8607.139286071468;8612.569371531523;5498.615096943256;5593.664380137205;5624.409437009137;5625.184348269478;5633.746481408347;5605.5795815313195;5638.746256418471;5639.718014099279;5687.516561092353;5689.516391106802;3255.6093268807895;3298.9175270617948;3330.0509354833757;3344.6822551857535;3352.0614228016193;1117.8826223246442;1149.9482523286472;1151.9712007199887;1161.6689243565713;1166.976660466786;420.60673270491577;424.16651280233873;463.1108272117542;490.4188536584159;496.4832436905289;9606.615735370646;9821;10524.684259472227;10850.511726972305;10939.070179034712;489.09517392822994;495.9330490383824;497.1325037808974;499.29848562769365;520.5835331734672;4699.553542413465;6194.4115309045565;6382.575190409116;6510.121133646991;6525.347465253437;534080;535190;541622;550992;551362.620551047;40916.79541602273;74993.62503187449;76864.61567692125;77442.6127869357;77687.8346824798;542.8208691131917;552.1469329885257;553.5129086403939;553.9030669632798;554.2960440240871;10615.681529554126;10789.838152427563;10922.235443518877;10986.230963832775;11004;32993.835030824695;33169.50245746267;34822.651773482954;35430.114247144025;35645;42148.57851421447;42726.14547708966;43741.12517749563;44071;44627.55372446234;6814.488913331421;6998.6500674967065;7035.366816986291;7043.929560704328;7045.1898031727005;12481.56314528987;12640.494380225056;12783.105182637126;12951.611451656465;12971.870281297066;10728;10751.784964300827;10949.671509854717;10955.068819150461;11123.165762567678;10624.893751062391;10830.133589312678;10934.781304374028;10954.123670106532;11127.554897803997;10973.341599504056;11186.496607652512;11308.208425410472;11314.717132071764;11423;6882.518223724292;6925.68834402443;6947.5831450113155;6950.409215216561;6963.582185068912;10814.35113893169;10987.230893837355;11140.554377824796;11175.49710263024;11298.774024519627 05:51:42 INFO - 2015-11-17 05:51:42,146 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1359.816424782654;1672.8327167283273;1749.7462867884158;1756.2272600055974;1788.6869797785384;6689.899651505231;7101.360877521029;7186.928130718691;7267.854642907138;7297.59863207524;7546.622668866562;7577.204393538682;7601.77194684159;7609.239076092388;7612;1957.862949593529;1998.6902030185345;2256.638937769953;2277.954440911181;2278.532900755341;2293.1973809166743;2345.7067866516686;2346.5424242272766;2347.5187586544803;2348.9295321140394;2043;2057.7222075019904;2090.6132365512353;2096.067250073718;2099.128861522466;1977.6341376845257;2022.4943764058985;2184.9999999999923;2189.1462329691435;2242.820574354064;2238.4963383238805;2246.809021233197;2253.6957510736006;2256.5261295128043;2258.853174543666;7608.31525162738;7626.046744156981;7650.3497202737835;7662.348700360476;7662.65518051689;4560.543945605413;4653.418322709661;4656.348111264426;4659.114768194032;4660.324252983332;3104.891328803481;3159.4944808830705;3174.68253174683;3185.1877771168433;3228.7094161525342;1008.969730908074;1016.4003238089489;1038.0553696136556;1062.4846949229618;1081.0702795595782;10413.16694664425;10417.114545263661;10436.843447348296;10460.215483838667;10470.581176752921;4177.874663760092;4282.250606143913;4284.67864910133;4322.286822674224;4327.891802704958;8947.59735811877;8960.32797540174;8964.8655270171;8965.50689712072;8973.05782892787;4720.103180395714;4722.338872557844;4742.383490146259;4750.358701575312;4756.262779269219;4294.592013758688;4321.78391080451;4323;4330.653547716175;4337.674674399433;3620.8913732588067;3661.2494438640015;3664.358737220976;3687.2256826066828;3708.2768860072565;1163.1044096046166;1167.7839599674087;1170.3738499902681;1172.0916289875415;1175.2419689300352;1294.5922034559085;1309.8755618216255;1317.440087962612;1332.4470344806796;1346.5690978886857;6598.241202261801;6651.368120028589;7074.7170113195925;7110.893336599956;7151;693.6150436507686;711.718871045934;711.7580022792275;714.76770049733;727.6580007396515;5532.6680399175375;5553.083741182741;5556.6943818089585;5570.860728481739;5572.442755724395;8897.28821694276;8977.192052715287;9063.274938004944;9237.261019118454;9302.95348523253;8998.370114091951;9042.63829446828;9127.90872091284;9160.267178625694;9170.86243706345;7082.893756593655;7179.38463845641;7192.31672991065;7195.96402017997;7232.421406287484;6848.520603557703;6894.069300644349;6898.275681053417;6900.481893983316;6920.7231710731;7501;7719.459637825298;7791.026121734783;7804.9219507806465;8078.596070196584;7565.167831538636;7715;7724.304812566896;7851.882221766564;7945.1657575953695;6868.3638543981615;6878.65606719652;6972.442204623517;7004.124484439445;7011.4741394394605;7519.398448124246;7546.584937828472;7546.735864244725;7560.773176804704;7573.810654733676;6818.284080171709;6836.658167091526;6949.826254343682;6997.090378250999;7083.7520686775715;6930.44556435494;6939.375456208763;6968.3728464438445;7020.368166865007;7059.152901651834;6280.183576135256;6308.653024083719;6443.130177425987;6867.416269617139;6904.930950690429;6357.682115894279;6433.131527243762;6454.677266136769;6465.64438955862;6468.450181734605;6138.693065346804;6376.585521941059;6467.029945508023;6469.708863101077;6490.902636460362 05:51:42 INFO - 2015-11-17 05:51:42,149 DEBUG : BROWSER_OUTPUT: |4;prototype.html;322.91281354034413;328.3678918082692;330.20420785905964;334.0379706445437;335.81194531062624;5876.236089308384;5886.676232807199;5977.312609049955;6006.489448396881;6009.489193418564;5803.825885223439;5894.6168499047535;5963.165156878041;5965.88068238635;5970.343262241161;4595.425571803525;4601.907961840761;4602.194615942213;4602.930956035645;4609.838655647061;4422.137683151786;4480.260756975112;4512.684112112153;4526.524714904937;4617.07658468306;4409.360642706805;4481.081378317437;4483.551644835523;4510.887227819314;4531;4506.774661266956;4517.028838799641;4517.051419201972;4523.050159466516;4541.682082254243;3925.9214815703526;3931.76409415436;3939.4878665773267;3946.954057174851;3950.9012274693077;5555.2222688823595;5645.830625081254;5647.519960803336;5678.205051292823;5706.457886500776;5234.738263086831;5241.135212689902;5241.3710354757295;5244.213367994793;5272.919051594414;6037.396260373927;6344.175257216579;6344.936550634481;6351.396617321347;6352;4219.135077309144;4289.056407590325;4348.28253338202;4351.956480435187;4391.714538554984;6428;6537.052127441494;6546.149000629887;6548;6550.541462097655;4446.3108218226225;4458.9331160032625;4459.531749166291;4467.955320446754;4469.865904022885;4422.5356337584735;4500.842470513517;4511.3458548510935;4512.142692888341;4539.31910213464;5223.112070947948;5229.921551176735;5239.816606418757;5241.554467870197;5243.239730239094;6343.5876668016435;6352.904706429407;6354.3963323484195;6371.076193951851;6371.776987805404;1577.8895477316707;1600.391851096576;1601.0793793568744;1601.5035339044932;1603.1022627328732;1052.6894566103017;1061.9575216991389;1064.5475672839013;1082.815921293382;1092.5302120088438;6142.201513803267;6171.074338849119;6173.753049878044;6184.845378865474;6187.133801267826;6527.608343499311;6555.6066636002;6563.803085907431;6566.047923051131;6575.210974683068;6054.424829641177;6174.9073763893575;6175.907361389583;6176.8764624707255;6183.443490085824;3547.0954906498678;3562.98218508911;3566.4472006838982;3569.464580312922;3572.91067723309;6697.564658297195;6698.866022679519;6699.430548403343;6705.362990515893;6711.966440167768;6577.210734711865;6642.070110184578;6706;6712.597244165366;6713.160854893138;6672.866542669217;6673.833154171185;6682.365175308435;6686.732530698718;6690.59856408617;6376.139221205078;6527.608343499405;6528.086067950396;6531.281559028598;6546.18172728409;6332.0818481320875;6432.035194720642;6495.837604059936;6520.771772987922;6521.967390163209;6680.899786503109;6708.094407255153;6710.060591517289;6715.764948226984;6731.124953755981;4257.27626303523;4310;4323.3731108988395;4331.80506877185;4415.514293427785;6558.147440832661;6558.245801732862;6563.245226798788;6566.573172743756;6575;6384.553081284265;6398.712057957497;6398.976163813767;6401.8399540010005;6401.935980640134;6264.718087685974;6366.4083979005245;6372.936270637234;6385.265694445198;6386;6260.874782504416;6268.373162683695;6268.561200715906;6271.874562508633;6275.3724627536885;6416.101745755504;6424.646644434601;6426.903596446151;6428.4857211423905;6429.4856411486035;6121.571489995657;6241.625502469867;6253.624782513064;6257.624542527463;6259.217597800275 05:51:42 INFO - 2015-11-17 05:51:42,149 DEBUG : BROWSER_OUTPUT: |5;yui.html;853.0914575976584;862.6376921692888;870.1211776106132;875.4134729731081;887.449781135696;12903;13256.801147982787;13264.071514993955;13271.933640331808;13291.202527848336;13378.197308161492;13407.731845363087;13461.865381346184;13464.596062118128;13470.393832277547;660.9206895172562;666.6766618190173;806.6853926968487;807.5316316536409;821.8685010398337;801.5831767480906;810;810.4165001199157;812.8049268175624;813.5525460996458;839.6851180807197;859.6518410043942;861.8362511122898;862.2326129744532;862.482510493705;697.4385619576265;701.3092104277283;837.5477242289156;850.0946491986015;855.315747402079;627.9497640188774;628.475223188638;629.2071989293478;630.180765005491;632.1055706175756;12190.634280971584;12455.12814103013;12471.438785254595;12722.193626409919;12794.552190673281;11295.887041129567;11580.247283926517;11805.114616403804;12122.090843186796;12484.75030499394;9665.951670241675;10326.277160598762;10365.429901355423;10386.376817390905;10530.210234232463;3303.8182899940493;3374.645662205482;3377.7466689998105;3394.62659107498;3455.585329760445;41242.587574124176;41433.58566414328;41451.58548414507;41566.58433415657;41668.79165604183;7551.886721699179;7556.395488360918;7573.318401343906;7638.656260468181;7645.617719114022;11409.543618255342;11517.884821151849;11521.769564608829;11542;11561.595344163083;6599.934000660028;6710.731570737214;6737.59574425536;6754.797356079325;7145.285471452917;3986.0832008637594;3987.182627561343;4017.397390391465;4023.91952160961;4025.7383270087353;2695.380062585616;2702.945941081207;2714.429969706384;2719.1978366381963;2720.7551320380867;430.8728924967142;433.76143121283167;438.6688050521836;451.95706407891197;452.2966786646796;535.946405359461;632.2318383164385;635.8156134720879;680.9863802723918;683.3303362704578;8052.597370131587;8165.673373065129;8408.915910840935;9241;9570.234381249484;518.072649956581;543.9864003399947;599.3766482857866;722.3931897206372;739.3641468337225;3972.662323702518;4130.277201489727;4181.477315335583;4266.168097221012;4335.002949321673;56216.71891640516;56597.43402565922;56686.7165664169;57161.71419142878;57215;49698;49710;50129.49870501321;50275.497245027815;50446.243306350436;44958;45608;46067;46112.76943615328;46218.53781462142;7809.882851757342;8116.350691944512;8208.671653133808;8248.46384984974;8293.58532073406;34630.97850811568;34689.82655086708;35074.64925350714;35268.823655881555;35589;40221.1955760889;44411;44461;44461.33308000447;44865.551344487445;7746;7806.72676456344;7831.84336313282;7934.404919631166;7997.080335761462;10710.946445267724;10857.00099304866;11002.944985275022;11077.723056923642;11123.833142502706;9975.850362244717;10179.134773544332;10488.842667359842;10833.69572280462;10850.67447976562;10436.739081523023;10622.309549879234;10719.356838589709;10832.512536936014;11135.777284454427;7561.886571701319;10423.478826058818;10440.321379110334;11008.614698485835;11281.379524126252;9817.55820988043;9865.358751681119;9912.207023437963;10063.89936100659;10133.64532241368;9068.682596109105;9196.862047069166;9235.584398702209;9335.57989890443;9764.227682724835 05:51:42 INFO - 2015-11-17 05:51:42,149 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:51:42 INFO - 2015-11-17 05:51:42,149 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:51:42 INFO - 2015-11-17 05:51:42,149 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,785 05:51:42 INFO - 2015-11-17 05:51:42,149 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: __startTimestamp1447768302138__endTimestamp 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: Number of tests: 6 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5438.31 Median:5707.06 stddev:616.81 (10.8%) stddev-sans-first:592.88 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: Values: 3186.9 3240.4 3270.3 3287.5 3303.0 5277.6 5377.1 5399.6 5407.6 5440.8 5359.3 5394.1 5403.8 5411.7 5430.5 4930.8 4969.5 5027.7 5140.7 5150.8 4893.9 5073.0 5114.7 5134.2 5167.3 4824.7 4895.7 4923.4 4964.8 4976.3 4858.5 4870.1 4874.5 4895.8 4909.2 4740.8 4860.2 4870.8 4903.7 4918.8 5063.8 5138.2 5157.1 5162.4 5184.0 5783.7 5784.8 5785.5 5787.4 5790.1 5707.1 5783.7 5788.0 5803.4 5872.0 5427.6 5492.1 5493.8 5495.4 5499.1 5965.0 5966.3 5986.2 5990.6 5996.7 5711.6 5745.5 5796.0 5809.3 5827.8 5975.1 5977.5 5977.9 5989.6 6006.2 5932.1 5934.1 5934.4 5935.3 5939.3 5629.6 5732.4 5735.7 5762.0 5874.2 4503.7 4508.3 4509.5 4537.9 4548.4 3985.9 3990.4 4006.0 4025.6 4064.3 5428.5 5517.9 5561.7 5585.7 5606.2 5894.1 5921.0 5921.4 5926.1 5929.1 5598.7 5600.1 5600.3 5600.4 5606.1 4932.4 5027.0 5053.7 5087.3 5125.2 6046.5 6116.5 6119.6 6129.1 6129.6 5719.4 5928.5 5948.9 5950.9 5956.8 5870.8 5961.3 5963.7 5968.5 6009.8 5797.4 5807.4 5814.6 5816.2 5817.0 5807.4 5853.3 5867.9 5871.8 5919.8 5677.4 5751.0 5751.3 5755.6 5757.5 5713.0 5726.2 5728.9 5731.9 5732.5 5560.0 5587.7 5635.1 5648.0 5682.2 5872.1 5885.9 5891.2 5899.4 5939.7 5750.7 5751.6 5760.4 5762.0 5764.5 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:52162.27 Median:33874.74 stddev:96717.13 (285.5%) stddev-sans-first:96910.88 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: Values: 568.9 600.6 612.4 613.1 618.0 31960.7 32545.7 39214.6 39247.0 39263.4 42686.4 43190.4 43226.8 43229.4 43260.6 7613.9 8698.8 8868.0 8870.9 8872.2 7653.7 7785.5 10447.8 10680.1 10681.8 10396.0 10457.3 10505.9 10515.5 10531.4 10395.8 10412.1 10436.1 10483.7 10510.7 10280.3 10330.2 10349.6 10411.0 10412.3 40800.6 41316.8 41321.4 41338.0 41374.8 3446.8 3476.1 3514.6 3718.1 4018.5 29205.7 29624.0 29688.3 29796.7 29977.0 3536.6 3612.2 3645.6 3651.7 3698.0 270908.0 272143.0 272508.0 272882.0 274150.6 60628.0 61024.7 61063.0 61091.4 61144.7 65496.7 65609.3 65623.0 65624.0 65637.3 15121.9 15249.7 15289.2 15299.9 15307.2 11789.3 11817.8 11849.8 11856.5 11862.1 19433.3 20495.3 20537.2 20591.9 20656.4 6332.5 8033.3 8132.0 8395.9 8563.6 941.3 949.3 953.2 1031.5 1134.5 28069.9 28131.3 28777.3 28823.9 28850.3 1050.5 1058.5 1082.3 1126.7 1127.7 16601.9 17364.3 17386.5 17403.4 17426.3 400193.0 404194.0 433034.0 438356.0 684449.0 54700.7 55088.0 55374.4 55417.4 55463.7 1345.8 1348.8 1349.9 1352.7 1363.5 27249.7 32597.2 32632.5 32716.3 33081.0 48929.3 49502.3 49520.5 49592.8 49620.0 301176.0 302964.0 303640.0 304120.0 304364.0 31489.0 32602.2 32617.0 32647.7 32649.0 42551.0 42824.8 42889.8 43750.3 43812.6 36501.5 36896.4 36995.6 37084.6 37646.6 37034.6 40887.6 41406.0 42440.4 43575.0 40443.0 40492.0 40662.6 40729.8 41566.6 30991.4 31141.0 32862.8 33717.0 34032.5 26505.5 28211.7 28275.3 28428.3 28472.7 05:51:42 INFO - 2015-11-17 05:51:42,150 DEBUG : BROWSER_OUTPUT: 05:51:42 INFO - 2015-11-17 05:51:42,151 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:26949.41 Median:43906.06 stddev:88830.96 (202.3%) stddev-sans-first:89057.66 05:51:42 INFO - 2015-11-17 05:51:42,151 DEBUG : BROWSER_OUTPUT: Values: 331.6 344.4 345.3 347.6 348.3 14405.8 14716.6 16696.7 16917.7 17871.8 16101.7 16141.1 16312.3 16687.4 16696.0 5143.6 5259.2 5272.7 5276.0 5281.3 3916.3 4017.8 5239.0 5743.6 5936.2 5805.2 5825.1 5832.9 5841.4 5860.4 5687.6 5872.9 5875.0 5876.1 5879.7 5136.1 5144.1 5145.2 5152.7 5163.6 13005.3 13149.1 13387.7 13400.7 13420.5 1906.4 2063.3 2109.8 2167.5 2513.6 10056.3 10079.6 10263.5 10373.2 10399.7 1704.8 1715.4 1724.6 1739.7 1771.6 60711.4 61063.4 61783.4 62466.4 62899.7 7047.3 7079.9 7103.2 7145.2 7183.4 8533.7 8599.2 8600.3 8607.1 8612.6 5498.6 5593.7 5624.4 5625.2 5633.7 5605.6 5638.7 5639.7 5687.5 5689.5 3255.6 3298.9 3330.1 3344.7 3352.1 1117.9 1149.9 1152.0 1161.7 1167.0 420.6 424.2 463.1 490.4 496.5 9606.6 9821.0 10524.7 10850.5 10939.1 489.1 495.9 497.1 499.3 520.6 4699.6 6194.4 6382.6 6510.1 6525.3 534080.0 535190.0 541622.0 550992.0 551362.6 40916.8 74993.6 76864.6 77442.6 77687.8 542.8 552.1 553.5 553.9 554.3 10615.7 10789.8 10922.2 10986.2 11004.0 32993.8 33169.5 34822.7 35430.1 35645.0 42148.6 42726.1 43741.1 44071.0 44627.6 6814.5 6998.7 7035.4 7043.9 7045.2 12481.6 12640.5 12783.1 12951.6 12971.9 10728.0 10751.8 10949.7 10955.1 11123.2 10624.9 10830.1 10934.8 10954.1 11127.6 10973.3 11186.5 11308.2 11314.7 11423.0 6882.5 6925.7 6947.6 6950.4 6963.6 10814.4 10987.2 11140.6 11175.5 11298.8 05:51:42 INFO - 2015-11-17 05:51:42,152 DEBUG : BROWSER_OUTPUT: 05:51:42 INFO - 2015-11-17 05:51:42,152 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5319.14 Median:6438.13 stddev:2720.77 (42.3%) stddev-sans-first:2712.12 05:51:42 INFO - 2015-11-17 05:51:42,153 DEBUG : BROWSER_OUTPUT: Values: 1359.8 1672.8 1749.7 1756.2 1788.7 6689.9 7101.4 7186.9 7267.9 7297.6 7546.6 7577.2 7601.8 7609.2 7612.0 1957.9 1998.7 2256.6 2278.0 2278.5 2293.2 2345.7 2346.5 2347.5 2348.9 2043.0 2057.7 2090.6 2096.1 2099.1 1977.6 2022.5 2185.0 2189.1 2242.8 2238.5 2246.8 2253.7 2256.5 2258.9 7608.3 7626.0 7650.3 7662.3 7662.7 4560.5 4653.4 4656.3 4659.1 4660.3 3104.9 3159.5 3174.7 3185.2 3228.7 1009.0 1016.4 1038.1 1062.5 1081.1 10413.2 10417.1 10436.8 10460.2 10470.6 4177.9 4282.3 4284.7 4322.3 4327.9 8947.6 8960.3 8964.9 8965.5 8973.1 4720.1 4722.3 4742.4 4750.4 4756.3 4294.6 4321.8 4323.0 4330.7 4337.7 3620.9 3661.2 3664.4 3687.2 3708.3 1163.1 1167.8 1170.4 1172.1 1175.2 1294.6 1309.9 1317.4 1332.4 1346.6 6598.2 6651.4 7074.7 7110.9 7151.0 693.6 711.7 711.8 714.8 727.7 5532.7 5553.1 5556.7 5570.9 5572.4 8897.3 8977.2 9063.3 9237.3 9303.0 8998.4 9042.6 9127.9 9160.3 9170.9 7082.9 7179.4 7192.3 7196.0 7232.4 6848.5 6894.1 6898.3 6900.5 6920.7 7501.0 7719.5 7791.0 7804.9 8078.6 7565.2 7715.0 7724.3 7851.9 7945.2 6868.4 6878.7 6972.4 7004.1 7011.5 7519.4 7546.6 7546.7 7560.8 7573.8 6818.3 6836.7 6949.8 6997.1 7083.8 6930.4 6939.4 6968.4 7020.4 7059.2 6280.2 6308.7 6443.1 6867.4 6904.9 6357.7 6433.1 6454.7 6465.6 6468.5 6138.7 6376.6 6467.0 6469.7 6490.9 05:51:42 INFO - 2015-11-17 05:51:42,153 DEBUG : BROWSER_OUTPUT: 05:51:42 INFO - 2015-11-17 05:51:42,153 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5284.36 Median:6045.91 stddev:1602.68 (26.5%) stddev-sans-first:1563.31 05:51:42 INFO - 2015-11-17 05:51:42,153 DEBUG : BROWSER_OUTPUT: Values: 322.9 328.4 330.2 334.0 335.8 5876.2 5886.7 5977.3 6006.5 6009.5 5803.8 5894.6 5963.2 5965.9 5970.3 4595.4 4601.9 4602.2 4602.9 4609.8 4422.1 4480.3 4512.7 4526.5 4617.1 4409.4 4481.1 4483.6 4510.9 4531.0 4506.8 4517.0 4517.1 4523.1 4541.7 3925.9 3931.8 3939.5 3947.0 3950.9 5555.2 5645.8 5647.5 5678.2 5706.5 5234.7 5241.1 5241.4 5244.2 5272.9 6037.4 6344.2 6344.9 6351.4 6352.0 4219.1 4289.1 4348.3 4352.0 4391.7 6428.0 6537.1 6546.1 6548.0 6550.5 4446.3 4458.9 4459.5 4468.0 4469.9 4422.5 4500.8 4511.3 4512.1 4539.3 5223.1 5229.9 5239.8 5241.6 5243.2 6343.6 6352.9 6354.4 6371.1 6371.8 1577.9 1600.4 1601.1 1601.5 1603.1 1052.7 1062.0 1064.5 1082.8 1092.5 6142.2 6171.1 6173.8 6184.8 6187.1 6527.6 6555.6 6563.8 6566.0 6575.2 6054.4 6174.9 6175.9 6176.9 6183.4 3547.1 3563.0 3566.4 3569.5 3572.9 6697.6 6698.9 6699.4 6705.4 6712.0 6577.2 6642.1 6706.0 6712.6 6713.2 6672.9 6673.8 6682.4 6686.7 6690.6 6376.1 6527.6 6528.1 6531.3 6546.2 6332.1 6432.0 6495.8 6520.8 6522.0 6680.9 6708.1 6710.1 6715.8 6731.1 4257.3 4310.0 4323.4 4331.8 4415.5 6558.1 6558.2 6563.2 6566.6 6575.0 6384.6 6398.7 6399.0 6401.8 6401.9 6264.7 6366.4 6372.9 6385.3 6386.0 6260.9 6268.4 6268.6 6271.9 6275.4 6416.1 6424.6 6426.9 6428.5 6429.5 6121.6 6241.6 6253.6 6257.6 6259.2 05:51:42 INFO - 2015-11-17 05:51:42,153 DEBUG : BROWSER_OUTPUT: 05:51:42 INFO - 2015-11-17 05:51:42,153 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12971.00 Median:45837.50 stddev:15427.07 (33.7%) stddev-sans-first:15443.51 05:51:42 INFO - 2015-11-17 05:51:42,154 DEBUG : BROWSER_OUTPUT: Values: 853.1 862.6 870.1 875.4 887.4 12903.0 13256.8 13264.1 13271.9 13291.2 13378.2 13407.7 13461.9 13464.6 13470.4 660.9 666.7 806.7 807.5 821.9 801.6 810.0 810.4 812.8 813.6 839.7 859.7 861.8 862.2 862.5 697.4 701.3 837.5 850.1 855.3 627.9 628.5 629.2 630.2 632.1 12190.6 12455.1 12471.4 12722.2 12794.6 11295.9 11580.2 11805.1 12122.1 12484.8 9666.0 10326.3 10365.4 10386.4 10530.2 3303.8 3374.6 3377.7 3394.6 3455.6 41242.6 41433.6 41451.6 41566.6 41668.8 7551.9 7556.4 7573.3 7638.7 7645.6 11409.5 11517.9 11521.8 11542.0 11561.6 6599.9 6710.7 6737.6 6754.8 7145.3 3986.1 3987.2 4017.4 4023.9 4025.7 2695.4 2702.9 2714.4 2719.2 2720.8 430.9 433.8 438.7 452.0 452.3 535.9 632.2 635.8 681.0 683.3 8052.6 8165.7 8408.9 9241.0 9570.2 518.1 544.0 599.4 722.4 739.4 3972.7 4130.3 4181.5 4266.2 4335.0 56216.7 56597.4 56686.7 57161.7 57215.0 49698.0 49710.0 50129.5 50275.5 50446.2 44958.0 45608.0 46067.0 46112.8 46218.5 7809.9 8116.4 8208.7 8248.5 8293.6 34631.0 34689.8 35074.6 35268.8 35589.0 40221.2 44411.0 44461.0 44461.3 44865.6 7746.0 7806.7 7831.8 7934.4 7997.1 10710.9 10857.0 11002.9 11077.7 11123.8 9975.9 10179.1 10488.8 10833.7 10850.7 10436.7 10622.3 10719.4 10832.5 11135.8 7561.9 10423.5 10440.3 11008.6 11281.4 9817.6 9865.4 9912.2 10063.9 10133.6 9068.7 9196.9 9235.6 9335.6 9764.2 05:51:42 INFO - 2015-11-17 05:51:42,154 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:51:42 INFO - 2015-11-17 05:51:42,155 DEBUG : BROWSER_OUTPUT: 05:51:42 INFO - 2015-11-17 05:51:42,885 INFO : Browser exited with error code: 0 05:51:42 INFO - 2015-11-17 05:51:42,906 INFO : Completed test dromaeo_css (00:18:32) 05:51:42 INFO - 2015-11-17 05:51:42,906 INFO : Starting test kraken 05:51:42 INFO - 2015-11-17 05:51:42,906 DEBUG : operating with platform_type : linux_ 05:51:42 INFO - 2015-11-17 05:51:42,906 INFO : Initialising browser for kraken test... 05:51:42 INFO - 2015-11-17 05:51:42,912 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpLf3YeZ/profile http://localhost:39819/getInfo.html 05:51:46 INFO - 2015-11-17 05:51:46,571 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:51:46 INFO - 2015-11-17 05:51:46,571 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:51:46 INFO - 2015-11-17 05:51:46,571 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:51:46 INFO - 2015-11-17 05:51:46,571 DEBUG : BROWSER_OUTPUT: __metrics 05:51:46 INFO - 2015-11-17 05:51:46,753 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:51:47 INFO - 2015-11-17 05:51:47,883 INFO : Browser initialized. 05:51:47 INFO - 2015-11-17 05:51:47,883 INFO : Running cycle 1/1 for kraken test... 05:51:47 INFO - 2015-11-17 05:51:47,884 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpLf3YeZ/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:51:59 INFO - 2015-11-17 05:51:59,671 DEBUG : BROWSER_OUTPUT: RSS: Main: 141418496 05:51:59 INFO - 2015-11-17 05:51:59,671 DEBUG : BROWSER_OUTPUT: 05:52:02 INFO - 2015-11-17 05:52:02,112 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39819/tests/kraken/driver.html?testName=audio-beat-detection) 05:52:02 INFO - 2015-11-17 05:52:02,694 DEBUG : BROWSER_OUTPUT: RSS: Main: 180269056 05:52:02 INFO - 2015-11-17 05:52:02,694 DEBUG : BROWSER_OUTPUT: 05:52:05 INFO - 2015-11-17 05:52:05,330 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39819/tests/kraken/driver.html?testName=audio-dft) 05:52:05 INFO - 2015-11-17 05:52:05,903 DEBUG : BROWSER_OUTPUT: RSS: Main: 169603072 05:52:05 INFO - 2015-11-17 05:52:05,903 DEBUG : BROWSER_OUTPUT: 05:52:08 INFO - 2015-11-17 05:52:08,767 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39819/tests/kraken/driver.html?testName=audio-fft) 05:52:09 INFO - 2015-11-17 05:52:09,328 DEBUG : BROWSER_OUTPUT: RSS: Main: 150839296 05:52:09 INFO - 2015-11-17 05:52:09,328 DEBUG : BROWSER_OUTPUT: 05:52:11 INFO - 2015-11-17 05:52:11,280 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39819/tests/kraken/driver.html?testName=audio-oscillator) 05:52:11 INFO - 2015-11-17 05:52:11,841 DEBUG : BROWSER_OUTPUT: RSS: Main: 152145920 05:52:11 INFO - 2015-11-17 05:52:11,841 DEBUG : BROWSER_OUTPUT: 05:52:14 INFO - 2015-11-17 05:52:14,006 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39819/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:52:14 INFO - 2015-11-17 05:52:14,567 DEBUG : BROWSER_OUTPUT: RSS: Main: 155914240 05:52:14 INFO - 2015-11-17 05:52:14,567 DEBUG : BROWSER_OUTPUT: 05:52:17 INFO - 2015-11-17 05:52:17,464 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39819/tests/kraken/driver.html?testName=imaging-darkroom) 05:52:18 INFO - 2015-11-17 05:52:18,033 DEBUG : BROWSER_OUTPUT: RSS: Main: 156495872 05:52:18 INFO - 2015-11-17 05:52:18,033 DEBUG : BROWSER_OUTPUT: 05:52:21 INFO - 2015-11-17 05:52:21,454 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39819/tests/kraken/driver.html?testName=imaging-desaturate) 05:52:22 INFO - 2015-11-17 05:52:22,020 DEBUG : BROWSER_OUTPUT: RSS: Main: 157110272 05:52:22 INFO - 2015-11-17 05:52:22,020 DEBUG : BROWSER_OUTPUT: 05:52:24 INFO - 2015-11-17 05:52:24,760 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39819/tests/kraken/driver.html?testName=json-parse-financial) 05:52:25 INFO - 2015-11-17 05:52:25,333 DEBUG : BROWSER_OUTPUT: RSS: Main: 156172288 05:52:25 INFO - 2015-11-17 05:52:25,334 DEBUG : BROWSER_OUTPUT: 05:52:26 INFO - 2015-11-17 05:52:26,863 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39819/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:52:27 INFO - 2015-11-17 05:52:27,426 DEBUG : BROWSER_OUTPUT: RSS: Main: 165892096 05:52:27 INFO - 2015-11-17 05:52:27,426 DEBUG : BROWSER_OUTPUT: 05:52:29 INFO - 2015-11-17 05:52:29,248 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39819/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:52:29 INFO - 2015-11-17 05:52:29,849 DEBUG : BROWSER_OUTPUT: RSS: Main: 165498880 05:52:29 INFO - 2015-11-17 05:52:29,849 DEBUG : BROWSER_OUTPUT: 05:52:31 INFO - 2015-11-17 05:52:31,893 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39819/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:52:32 INFO - 2015-11-17 05:52:32,461 DEBUG : BROWSER_OUTPUT: RSS: Main: 175448064 05:52:32 INFO - 2015-11-17 05:52:32,462 DEBUG : BROWSER_OUTPUT: 05:52:34 INFO - 2015-11-17 05:52:34,864 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39819/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:52:35 INFO - 2015-11-17 05:52:35,445 DEBUG : BROWSER_OUTPUT: RSS: Main: 181026816 05:52:35 INFO - 2015-11-17 05:52:35,446 DEBUG : BROWSER_OUTPUT: 05:52:37 INFO - 2015-11-17 05:52:37,992 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39819/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:52:38 INFO - 2015-11-17 05:52:38,558 DEBUG : BROWSER_OUTPUT: RSS: Main: 180350976 05:52:38 INFO - 2015-11-17 05:52:38,558 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,227 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39819/tests/kraken/driver.html?testName=ai-astar) 05:52:40 INFO - 2015-11-17 05:52:40,476 DEBUG : BROWSER_OUTPUT: RSS: Main: 238297088 05:52:40 INFO - 2015-11-17 05:52:40,476 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,476 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:52:40 INFO - 2015-11-17 05:52:40,476 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |0;ai-astar;109;109;104;110;110;110;100;109;112;109 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;150;124;147;174;130;171;148;127;164;126 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;161;162;162;162;162;161;163;162;164 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;72;85;93;71;72;72;121;89;71 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;91;90;135;90;91;91;144;91;91;133 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;109;110;110;109;110;110;109;109;109 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;145;145;147;145;145;145;146;145;165;145 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;96;96;96;96;97;96;96;96;96 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;59;59;57;57;57;57;58;65;55;57 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;69;70;69;70;69;70;69;69;69;70 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;84;85;85;85;89;87;85;86;86;88 05:52:40 INFO - 2015-11-17 05:52:40,477 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;118;114;124;115;118;118;123;124;119;130 05:52:40 INFO - 2015-11-17 05:52:40,478 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;149;145;148;150;140;140;150;148;148;154 05:52:40 INFO - 2015-11-17 05:52:40,478 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;66;65;66;67;65;67;66;65;65;65 05:52:40 INFO - 2015-11-17 05:52:40,478 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:52:40 INFO - 2015-11-17 05:52:40,478 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:52:40 INFO - 2015-11-17 05:52:40,478 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,911 05:52:40 INFO - 2015-11-17 05:52:40,478 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:52:40 INFO - 2015-11-17 05:52:40,478 DEBUG : BROWSER_OUTPUT: __startTimestamp1447768360474__endTimestamp 05:52:40 INFO - 2015-11-17 05:52:40,478 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,479 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:52:40 INFO - 2015-11-17 05:52:40,479 DEBUG : BROWSER_OUTPUT: Number of tests: 14 05:52:40 INFO - 2015-11-17 05:52:40,479 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,479 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:108.20 Median:109.50 stddev:3.52 (3.2%) stddev-sans-first:3.72 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: Values: 109.0 109.0 104.0 110.0 110.0 110.0 100.0 109.0 112.0 109.0 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:146.10 Median:149.00 stddev:19.02 (12.8%) stddev-sans-first:20.12 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: Values: 150.0 124.0 147.0 174.0 130.0 171.0 148.0 127.0 164.0 126.0 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:162.00 Median:162.00 stddev:0.94 (0.6%) stddev-sans-first:0.93 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: Values: 161.0 161.0 162.0 162.0 162.0 162.0 161.0 163.0 162.0 164.0 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:81.80 Median:72.00 stddev:16.13 (22.4%) stddev-sans-first:16.71 05:52:40 INFO - 2015-11-17 05:52:40,480 DEBUG : BROWSER_OUTPUT: Values: 72.0 72.0 85.0 93.0 71.0 72.0 72.0 121.0 89.0 71.0 05:52:40 INFO - 2015-11-17 05:52:40,481 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,481 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:104.70 Median:91.00 stddev:22.69 (24.9%) stddev-sans-first:23.52 05:52:40 INFO - 2015-11-17 05:52:40,481 DEBUG : BROWSER_OUTPUT: Values: 91.0 90.0 135.0 90.0 91.0 91.0 144.0 91.0 91.0 133.0 05:52:40 INFO - 2015-11-17 05:52:40,481 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,482 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.40 Median:109.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 05:52:40 INFO - 2015-11-17 05:52:40,482 DEBUG : BROWSER_OUTPUT: Values: 109.0 109.0 110.0 110.0 109.0 110.0 110.0 109.0 109.0 109.0 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:147.30 Median:145.00 stddev:6.25 (4.3%) stddev-sans-first:6.58 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: Values: 145.0 145.0 147.0 145.0 145.0 145.0 146.0 145.0 165.0 145.0 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: Values: 96.0 96.0 96.0 96.0 96.0 97.0 96.0 96.0 96.0 96.0 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:58.10 Median:57.50 stddev:2.69 (4.7%) stddev-sans-first:2.83 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: Values: 59.0 59.0 57.0 57.0 57.0 57.0 58.0 65.0 55.0 57.0 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:69.40 Median:69.50 stddev:0.52 (0.7%) stddev-sans-first:0.53 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: Values: 69.0 70.0 69.0 70.0 69.0 70.0 69.0 69.0 69.0 70.0 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,483 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:86.00 Median:86.00 stddev:1.56 (1.8%) stddev-sans-first:1.48 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: Values: 84.0 85.0 85.0 85.0 89.0 87.0 85.0 86.0 86.0 88.0 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:120.30 Median:121.00 stddev:4.88 (4.0%) stddev-sans-first:5.10 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: Values: 118.0 114.0 124.0 115.0 118.0 118.0 123.0 124.0 119.0 130.0 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:147.20 Median:148.50 stddev:4.42 (3.0%) stddev-sans-first:4.64 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: Values: 149.0 145.0 148.0 150.0 140.0 140.0 150.0 148.0 148.0 154.0 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.70 Median:66.00 stddev:0.82 (1.2%) stddev-sans-first:0.87 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: Values: 66.0 65.0 66.0 67.0 65.0 67.0 66.0 65.0 65.0 65.0 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:52:40 INFO - 2015-11-17 05:52:40,484 DEBUG : BROWSER_OUTPUT: 05:52:41 INFO - 2015-11-17 05:52:41,337 INFO : Browser exited with error code: 0 05:52:41 INFO - 2015-11-17 05:52:41,393 INFO : Completed test kraken (00:00:58) 05:52:41 INFO - 2015-11-17 05:52:41,393 INFO : Starting test v8_7 05:52:41 INFO - 2015-11-17 05:52:41,393 DEBUG : operating with platform_type : linux_ 05:52:41 INFO - 2015-11-17 05:52:41,393 INFO : Initialising browser for v8_7 test... 05:52:41 INFO - 2015-11-17 05:52:41,399 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp5Iop_B/profile http://localhost:39819/getInfo.html 05:52:44 INFO - 2015-11-17 05:52:44,993 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:52:44 INFO - 2015-11-17 05:52:44,994 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:52:44 INFO - 2015-11-17 05:52:44,994 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 05:52:44 INFO - 2015-11-17 05:52:44,994 DEBUG : BROWSER_OUTPUT: __metrics 05:52:45 INFO - 2015-11-17 05:52:45,110 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 05:52:46 INFO - 2015-11-17 05:52:46,320 INFO : Browser initialized. 05:52:46 INFO - 2015-11-17 05:52:46,320 INFO : Running cycle 1/1 for v8_7 test... 05:52:46 INFO - 2015-11-17 05:52:46,320 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp5Iop_B/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:52:58 INFO - 2015-11-17 05:52:58,113 DEBUG : BROWSER_OUTPUT: RSS: Main: 141246464 05:52:58 INFO - 2015-11-17 05:52:58,114 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,562 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:39819/tests/v8_7/run.html (next: http://localhost:39819/tests/v8_7/run.html) 05:53:19 INFO - 2015-11-17 05:53:19,820 DEBUG : BROWSER_OUTPUT: RSS: Main: 605007872 05:53:19 INFO - 2015-11-17 05:53:19,820 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,820 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:53:19 INFO - 2015-11-17 05:53:19,820 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:53:19 INFO - 2015-11-17 05:53:19,820 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:53:19 INFO - 2015-11-17 05:53:19,821 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:53:19 INFO - 2015-11-17 05:53:19,821 DEBUG : BROWSER_OUTPUT: |0;Richards;165.48072149594572 05:53:19 INFO - 2015-11-17 05:53:19,821 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;193.6858415649816 05:53:19 INFO - 2015-11-17 05:53:19,821 DEBUG : BROWSER_OUTPUT: |2;Encrypt;284.7380410022779 05:53:19 INFO - 2015-11-17 05:53:19,821 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5035.175879396985 05:53:19 INFO - 2015-11-17 05:53:19,821 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1976.2845849802372 05:53:19 INFO - 2015-11-17 05:53:19,821 DEBUG : BROWSER_OUTPUT: |5;Earley;841.7508417508418 05:53:19 INFO - 2015-11-17 05:53:19,821 DEBUG : BROWSER_OUTPUT: |6;Boyer;12280.487804878048 05:53:19 INFO - 2015-11-17 05:53:19,822 DEBUG : BROWSER_OUTPUT: |7;RegExp;25350 05:53:19 INFO - 2015-11-17 05:53:19,822 DEBUG : BROWSER_OUTPUT: |8;Splay;617.5395858708891 05:53:19 INFO - 2015-11-17 05:53:19,822 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4826.923076923077 05:53:19 INFO - 2015-11-17 05:53:19,822 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:53:19 INFO - 2015-11-17 05:53:19,822 DEBUG : BROWSER_OUTPUT: __startTimestamp1447768399813__endTimestamp 05:53:19 INFO - 2015-11-17 05:53:19,822 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,822 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:53:19 INFO - 2015-11-17 05:53:19,823 DEBUG : BROWSER_OUTPUT: Number of tests: 10 05:53:19 INFO - 2015-11-17 05:53:19,823 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,823 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:165.48 Median:165.48 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,823 DEBUG : BROWSER_OUTPUT: Values: 165.5 05:53:19 INFO - 2015-11-17 05:53:19,823 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,823 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:193.69 Median:193.69 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,823 DEBUG : BROWSER_OUTPUT: Values: 193.7 05:53:19 INFO - 2015-11-17 05:53:19,823 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,824 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:284.74 Median:284.74 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,824 DEBUG : BROWSER_OUTPUT: Values: 284.7 05:53:19 INFO - 2015-11-17 05:53:19,824 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,824 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5035.18 Median:5035.18 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,824 DEBUG : BROWSER_OUTPUT: Values: 5035.2 05:53:19 INFO - 2015-11-17 05:53:19,824 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,824 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1976.28 Median:1976.28 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: Values: 1976.3 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:841.75 Median:841.75 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: Values: 841.8 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12280.49 Median:12280.49 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: Values: 12280.5 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:25350.00 Median:25350.00 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: Values: 25350.0 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:617.54 Median:617.54 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: Values: 617.5 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: 05:53:19 INFO - 2015-11-17 05:53:19,825 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4826.92 Median:4826.92 stddev:0.00 (0.0%) 05:53:19 INFO - 2015-11-17 05:53:19,826 DEBUG : BROWSER_OUTPUT: Values: 4826.9 05:53:19 INFO - 2015-11-17 05:53:19,826 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:53:19 INFO - 2015-11-17 05:53:19,826 DEBUG : BROWSER_OUTPUT: 05:53:20 INFO - 2015-11-17 05:53:20,677 INFO : Browser exited with error code: 0 05:53:20 INFO - 2015-11-17 05:53:20,692 INFO : Completed test v8_7 (00:00:39) 05:53:20 INFO - 2015-11-17 05:53:20,771 INFO : Completed test suite (00:20:10) 05:53:20 INFO - 2015-11-17 05:53:20,771 DEBUG : Working with test: dromaeo_css 05:53:20 INFO - 2015-11-17 05:53:20,771 DEBUG : Generating results file: dromaeo_css 05:53:20 INFO - 2015-11-17 05:53:20,772 DEBUG : Working with test: kraken 05:53:20 INFO - 2015-11-17 05:53:20,773 DEBUG : Generating results file: kraken 05:53:20 INFO - 2015-11-17 05:53:20,773 INFO : javascript benchmark 05:53:20 INFO - 2015-11-17 05:53:20,773 DEBUG : Working with test: v8_7 05:53:20 INFO - 2015-11-17 05:53:20,773 DEBUG : Generating results file: v8_7 05:53:20 INFO - 2015-11-17 05:53:20,774 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:53:20 INFO - 2015-11-17 05:53:20,824 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,1,35]] 05:53:20 INFO - 2015-11-17 05:53:20,824 DEBUG : process_Request line: dromaeo_css 6716.68 graph.html#tests=[[72,1,35]] 05:53:20 INFO - 2015-11-17 05:53:20,824 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:53:20 INFO - 2015-11-17 05:53:20,856 DEBUG : process_Request line: kraken 1502.30 graph.html#tests=[[232,1,35]] 05:53:20 INFO - 2015-11-17 05:53:20,856 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:53:20 INFO - 2015-11-17 05:53:20,892 DEBUG : process_Request line: v8_7 19690.59 graph.html#tests=[[230,1,35]] 05:53:20 INFO - 2015-11-17 05:53:20,894 INFO : javascript benchmark 05:53:20 INFO - 2015-11-17 05:53:20,897 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [331.60538958639205, 344.36808456482356, 345.3389197957823, 347.6054677940538, 348.2860136719724, 14405.783913241283, 14716.55850324492, 16696.666066678674, 16917.661646767072, 17871.82128178718, 16101.677966440664, 16141.11223882686, 16312.347506099743, 16687.415940442086, 16696.0, 5143.562797162245, 5259.158534634459, 5272.710000949965, 5275.971185618806, 5281.260623512711, 3916.295066887959, 4017.799110044486, 5238.973805130988, 5743.597948143632, 5936.168936348915, 5805.158252053449, 5825.097109947965, 5832.883342333172, 5841.357450680422, 5860.355360910296, 5687.630304030225, 5872.853178670524, 5875.030619947704, 5876.11858221266, 5879.706014699269, 5136.126858434075, 5144.099782538041, 5145.2024936134585, 5152.716600586966, 5163.561097306733, 13005.349732513336, 13149.145305555205, 13387.732245355039, 13400.664983375396, 13420.463181472729, 1906.4185423445842, 2063.267540023285, 2109.7679255281905, 2167.5231449081175, 2513.5978243481136, 10056.29605927578, 10079.647212347605, 10263.538140783683, 10373.170146388271, 10399.688009359732, 1704.8039475460357, 1715.4339068107495, 1724.6033412315112, 1739.6781595404764, 1771.6102457459338, 60711.411073615796, 61063.38936610666, 61783.38216617821, 62466.37533624651, 62899.685501572196, 7047.295270472911, 7079.893801592877, 7103.183133939559, 7145.249748776408, 7183.42532597391, 8533.74398768038, 8599.226069653761, 8600.268977137013, 8607.139286071468, 8612.569371531523, 5498.615096943256, 5593.664380137205, 5624.409437009137, 5625.184348269478, 5633.746481408347, 5605.5795815313195, 5638.746256418471, 5639.718014099279, 5687.516561092353, 5689.516391106802, 3255.6093268807895, 3298.9175270617948, 3330.0509354833757, 3344.6822551857535, 3352.0614228016193, 1117.8826223246442, 1149.9482523286472, 1151.9712007199887, 1161.6689243565713, 1166.976660466786, 420.60673270491577, 424.16651280233873, 463.1108272117542, 490.4188536584159, 496.4832436905289, 9606.615735370646, 9821.0, 10524.684259472227, 10850.511726972305, 10939.070179034712, 489.09517392822994, 495.9330490383824, 497.1325037808974, 499.29848562769365, 520.5835331734672, 4699.553542413465, 6194.4115309045565, 6382.575190409116, 6510.121133646991, 6525.347465253437, 534080.0, 535190.0, 541622.0, 550992.0, 551362.620551047, 40916.79541602273, 74993.62503187449, 76864.61567692125, 77442.6127869357, 77687.8346824798, 542.8208691131917, 552.1469329885257, 553.5129086403939, 553.9030669632798, 554.2960440240871, 10615.681529554126, 10789.838152427563, 10922.235443518877, 10986.230963832775, 11004.0, 32993.835030824695, 33169.50245746267, 34822.651773482954, 35430.114247144025, 35645.0, 42148.57851421447, 42726.14547708966, 43741.12517749563, 44071.0, 44627.55372446234, 6814.488913331421, 6998.6500674967065, 7035.366816986291, 7043.929560704328, 7045.1898031727005, 12481.56314528987, 12640.494380225056, 12783.105182637126, 12951.611451656465, 12971.870281297066, 10728.0, 10751.784964300827, 10949.671509854717, 10955.068819150461, 11123.165762567678, 10624.893751062391, 10830.133589312678, 10934.781304374028, 10954.123670106532, 11127.554897803997, 10973.341599504056, 11186.496607652512, 11308.208425410472, 11314.717132071764, 11423.0, 6882.518223724292, 6925.68834402443, 6947.5831450113155, 6950.409215216561, 6963.582185068912, 10814.35113893169, 10987.230893837355, 11140.554377824796, 11175.49710263024, 11298.774024519627], "dojo.html": [3186.856591453384, 3240.4005259027094, 3270.3132342208137, 3287.5233091201776, 3303.042117785842, 5277.577793776498, 5377.139657654776, 5399.595030372718, 5407.567394608432, 5440.761407927683, 5359.30329057223, 5394.136938089907, 5403.83788486346, 5411.702356370398, 5430.5384042356445, 4930.827421040264, 4969.527894849993, 5027.748612569375, 5140.742962851861, 5150.845474635767, 4893.926591101136, 5072.960043191156, 5114.667546609477, 5134.1528647773075, 5167.302414174076, 4824.734639594839, 4895.681780684244, 4923.433805112422, 4964.776585053682, 4976.278439626252, 4858.514148585148, 4870.07468580972, 4874.512548745132, 4895.755212239374, 4909.165441874889, 4740.786664600101, 4860.1737704590305, 4870.829520966785, 4903.705777653352, 4918.803247870081, 5063.8480845574695, 5138.177891537336, 5157.07172708916, 5162.354705661793, 5184.0, 5783.710814459302, 5784.768609255625, 5785.53715702747, 5787.392323806024, 5790.073588225906, 5707.058335374658, 5783.652980821164, 5788.04497257952, 5803.390643982363, 5872.031114866042, 5427.6472029317965, 5492.066348720727, 5493.807716729895, 5495.368032676213, 5499.065158922993, 5965.045592705146, 5966.31387390447, 5986.191864098378, 5990.610610310316, 5996.730147143389, 5711.628744131618, 5745.454181852718, 5796.0, 5809.331926828384, 5827.825165245049, 5975.073863551156, 5977.521798256129, 5977.880442391128, 5989.580729348903, 6006.189164462829, 5932.0508718604815, 5934.080217566284, 5934.43622855828, 5935.258092738408, 5939.287285525678, 5629.605927585029, 5732.398098199712, 5735.741891614887, 5761.971190144106, 5874.236349274653, 4503.662225333113, 4508.346289787963, 4509.526499717483, 4537.886552836139, 4548.363229147922, 3985.860494882665, 3990.38149086892, 4005.9599404005585, 4025.6175663311938, 4064.2684316822665, 5428.4842939920645, 5517.944820551824, 5561.749721262553, 5585.720713964285, 5606.187102870061, 5894.056950887837, 5921.0, 5921.437463440966, 5926.140709597084, 5929.14027466015, 5598.664080155204, 5600.131979543177, 5600.299962504687, 5600.439956004367, 5606.074997625346, 4932.358793356841, 5027.044861476308, 5053.69677819332, 5087.3386459759995, 5125.205593133071, 6046.546509011841, 6116.480099191618, 6119.632822030692, 6129.11127886454, 6129.570930034854, 5719.399463056319, 5928.525717942468, 5948.910766338422, 5950.9404905952115, 5956.76172953077, 5870.823875283749, 5961.254843144607, 5963.701814909324, 5968.522518198447, 6009.789657361971, 5797.391273916178, 5807.390224026585, 5814.592978491465, 5816.214811000461, 5817.040188368872, 5807.419258074159, 5853.326867410302, 5867.882642347044, 5871.794487193099, 5919.822405327847, 5677.432256774289, 5750.971245143747, 5751.281089863767, 5755.597108202385, 5757.481826635623, 5713.028785106459, 5726.198332233574, 5728.885422291614, 5731.942680573141, 5732.484076433141, 5560.0, 5587.720613969366, 5635.0702134147405, 5647.971760141338, 5682.232898558642, 5872.060470324727, 5885.94114058871, 5891.23413956183, 5899.439553242435, 5939.703014849327, 5750.741216645345, 5751.568632352674, 5760.423957604206, 5761.971190144022, 5764.510016648632], "mootools.html": [1359.816424782654, 1672.8327167283273, 1749.7462867884158, 1756.2272600055974, 1788.6869797785384, 6689.899651505231, 7101.360877521029, 7186.928130718691, 7267.854642907138, 7297.59863207524, 7546.622668866562, 7577.204393538682, 7601.77194684159, 7609.239076092388, 7612.0, 1957.862949593529, 1998.6902030185345, 2256.638937769953, 2277.954440911181, 2278.532900755341, 2293.1973809166743, 2345.7067866516686, 2346.5424242272766, 2347.5187586544803, 2348.9295321140394, 2043.0, 2057.7222075019904, 2090.6132365512353, 2096.067250073718, 2099.128861522466, 1977.6341376845257, 2022.4943764058985, 2184.9999999999923, 2189.1462329691435, 2242.820574354064, 2238.4963383238805, 2246.809021233197, 2253.6957510736006, 2256.5261295128043, 2258.853174543666, 7608.31525162738, 7626.046744156981, 7650.3497202737835, 7662.348700360476, 7662.65518051689, 4560.543945605413, 4653.418322709661, 4656.348111264426, 4659.114768194032, 4660.324252983332, 3104.891328803481, 3159.4944808830705, 3174.68253174683, 3185.1877771168433, 3228.7094161525342, 1008.969730908074, 1016.4003238089489, 1038.0553696136556, 1062.4846949229618, 1081.0702795595782, 10413.16694664425, 10417.114545263661, 10436.843447348296, 10460.215483838667, 10470.581176752921, 4177.874663760092, 4282.250606143913, 4284.67864910133, 4322.286822674224, 4327.891802704958, 8947.59735811877, 8960.32797540174, 8964.8655270171, 8965.50689712072, 8973.05782892787, 4720.103180395714, 4722.338872557844, 4742.383490146259, 4750.358701575312, 4756.262779269219, 4294.592013758688, 4321.78391080451, 4323.0, 4330.653547716175, 4337.674674399433, 3620.8913732588067, 3661.2494438640015, 3664.358737220976, 3687.2256826066828, 3708.2768860072565, 1163.1044096046166, 1167.7839599674087, 1170.3738499902681, 1172.0916289875415, 1175.2419689300352, 1294.5922034559085, 1309.8755618216255, 1317.440087962612, 1332.4470344806796, 1346.5690978886857, 6598.241202261801, 6651.368120028589, 7074.7170113195925, 7110.893336599956, 7151.0, 693.6150436507686, 711.718871045934, 711.7580022792275, 714.76770049733, 727.6580007396515, 5532.6680399175375, 5553.083741182741, 5556.6943818089585, 5570.860728481739, 5572.442755724395, 8897.28821694276, 8977.192052715287, 9063.274938004944, 9237.261019118454, 9302.95348523253, 8998.370114091951, 9042.63829446828, 9127.90872091284, 9160.267178625694, 9170.86243706345, 7082.893756593655, 7179.38463845641, 7192.31672991065, 7195.96402017997, 7232.421406287484, 6848.520603557703, 6894.069300644349, 6898.275681053417, 6900.481893983316, 6920.7231710731, 7501.0, 7719.459637825298, 7791.026121734783, 7804.9219507806465, 8078.596070196584, 7565.167831538636, 7715.0, 7724.304812566896, 7851.882221766564, 7945.1657575953695, 6868.3638543981615, 6878.65606719652, 6972.442204623517, 7004.124484439445, 7011.4741394394605, 7519.398448124246, 7546.584937828472, 7546.735864244725, 7560.773176804704, 7573.810654733676, 6818.284080171709, 6836.658167091526, 6949.826254343682, 6997.090378250999, 7083.7520686775715, 6930.44556435494, 6939.375456208763, 6968.3728464438445, 7020.368166865007, 7059.152901651834, 6280.183576135256, 6308.653024083719, 6443.130177425987, 6867.416269617139, 6904.930950690429, 6357.682115894279, 6433.131527243762, 6454.677266136769, 6465.64438955862, 6468.450181734605, 6138.693065346804, 6376.585521941059, 6467.029945508023, 6469.708863101077, 6490.902636460362], "ext.html": [568.9374168841426, 600.603601622929, 612.4212619074971, 613.0711971363385, 617.9783707570234, 31960.68039319606, 32545.67454325456, 39214.60785392145, 39247.0, 39263.41104883429, 42686.35970460445, 43190.35214471786, 43226.7838660807, 43229.35155972663, 43260.56739432605, 7613.885791713129, 8698.782530436742, 8867.955660221689, 8870.86693699595, 8872.245859101984, 7653.732119375823, 7785.455018148732, 10447.791044179112, 10680.145588352952, 10681.83977240342, 10396.0, 10457.267991240617, 10505.894941050607, 10515.52680129396, 10531.368117912949, 10395.804482484498, 10412.062914337708, 10436.112930400925, 10483.73790655232, 10510.684679459628, 10280.280380373377, 10330.225233107472, 10349.58601655933, 10411.010953959438, 10412.32319899204, 40800.59199408027, 41316.76049718513, 41321.38017929703, 41338.0, 41374.79312603418, 3446.844891979867, 3476.1483436558206, 3514.578250609943, 3718.1076541629814, 4018.5177778666457, 29205.70794292051, 29624.0, 29688.257793555335, 29796.702032979825, 29977.0, 3536.5579302587175, 3612.151144481045, 3645.6172101929446, 3651.72612054097, 3697.9815100924593, 270908.0, 272143.0, 272508.0, 272882.0, 274150.62924685446, 60628.0, 61024.69487652622, 61063.0, 61091.38908610946, 61144.69427652833, 65496.67251663711, 65609.34390656128, 65623.0, 65624.0, 65637.34362656408, 15121.924390378197, 15249.695006100037, 15289.159096249814, 15299.923500382427, 15307.15810630426, 11789.292642441482, 11817.822732659017, 11849.763004740029, 11856.466459009365, 11862.110341724232, 19433.31983380575, 20495.28266510665, 20537.17851285932, 20591.8970405147, 20656.380308590768, 6332.493400528039, 8033.277005069572, 8132.0, 8395.875465008765, 8563.614637341334, 941.3457646935315, 949.2880339745191, 953.1755031897359, 1031.4739482863793, 1134.5348407153028, 28069.859650702023, 28131.296717582223, 28777.280567985967, 28823.85588072046, 28850.27874303159, 1050.464263225745, 1058.5342449322275, 1082.2532452607675, 1126.6957921361186, 1127.656064900197, 16601.91699041497, 17364.305427783, 17386.4784056476, 17403.390881319094, 17426.302947882195, 400193.0, 404194.0, 433034.0, 438356.0, 684449.0, 54700.726496367264, 55088.0, 55374.44625553773, 55417.44582554203, 55463.72268138634, 1345.7577636025414, 1348.7504811609883, 1349.8582648821928, 1352.7024054708145, 1363.5227670315508, 27249.727502725513, 32597.18507037248, 32632.510512341858, 32716.345673086882, 33081.0, 48929.2660610084, 49502.257466137315, 49520.50479495159, 49592.75203623959, 49620.0, 301176.0, 302964.0, 303640.0, 304120.0, 304364.0, 31489.0, 32602.184945376557, 32617.0, 32647.673523264464, 32649.0, 42551.0, 42824.78587607042, 42889.78555107205, 43750.34374484449, 43812.561874380845, 36501.45247821232, 36896.44655330118, 36995.63004369922, 37084.6291537092, 37646.62353376541, 37034.629653703116, 40887.591124089566, 41406.0, 42440.36339454973, 43575.0, 40443.0, 40491.98770030773, 40662.593374067066, 40729.796351018056, 41566.58433415627, 30991.380172396875, 31141.0, 32862.83568582142, 33717.0, 34032.48951265783, 26505.469890601693, 28211.71788282091, 28275.293117672223, 28428.289292767848, 28472.715272847006], "prototype.html": [322.91281354034413, 328.3678918082692, 330.20420785905964, 334.0379706445437, 335.81194531062624, 5876.236089308384, 5886.676232807199, 5977.312609049955, 6006.489448396881, 6009.489193418564, 5803.825885223439, 5894.6168499047535, 5963.165156878041, 5965.88068238635, 5970.343262241161, 4595.425571803525, 4601.907961840761, 4602.194615942213, 4602.930956035645, 4609.838655647061, 4422.137683151786, 4480.260756975112, 4512.684112112153, 4526.524714904937, 4617.07658468306, 4409.360642706805, 4481.081378317437, 4483.551644835523, 4510.887227819314, 4531.0, 4506.774661266956, 4517.028838799641, 4517.051419201972, 4523.050159466516, 4541.682082254243, 3925.9214815703526, 3931.76409415436, 3939.4878665773267, 3946.954057174851, 3950.9012274693077, 5555.2222688823595, 5645.830625081254, 5647.519960803336, 5678.205051292823, 5706.457886500776, 5234.738263086831, 5241.135212689902, 5241.3710354757295, 5244.213367994793, 5272.919051594414, 6037.396260373927, 6344.175257216579, 6344.936550634481, 6351.396617321347, 6352.0, 4219.135077309144, 4289.056407590325, 4348.28253338202, 4351.956480435187, 4391.714538554984, 6428.0, 6537.052127441494, 6546.149000629887, 6548.0, 6550.541462097655, 4446.3108218226225, 4458.9331160032625, 4459.531749166291, 4467.955320446754, 4469.865904022885, 4422.5356337584735, 4500.842470513517, 4511.3458548510935, 4512.142692888341, 4539.31910213464, 5223.112070947948, 5229.921551176735, 5239.816606418757, 5241.554467870197, 5243.239730239094, 6343.5876668016435, 6352.904706429407, 6354.3963323484195, 6371.076193951851, 6371.776987805404, 1577.8895477316707, 1600.391851096576, 1601.0793793568744, 1601.5035339044932, 1603.1022627328732, 1052.6894566103017, 1061.9575216991389, 1064.5475672839013, 1082.815921293382, 1092.5302120088438, 6142.201513803267, 6171.074338849119, 6173.753049878044, 6184.845378865474, 6187.133801267826, 6527.608343499311, 6555.6066636002, 6563.803085907431, 6566.047923051131, 6575.210974683068, 6054.424829641177, 6174.9073763893575, 6175.907361389583, 6176.8764624707255, 6183.443490085824, 3547.0954906498678, 3562.98218508911, 3566.4472006838982, 3569.464580312922, 3572.91067723309, 6697.564658297195, 6698.866022679519, 6699.430548403343, 6705.362990515893, 6711.966440167768, 6577.210734711865, 6642.070110184578, 6706.0, 6712.597244165366, 6713.160854893138, 6672.866542669217, 6673.833154171185, 6682.365175308435, 6686.732530698718, 6690.59856408617, 6376.139221205078, 6527.608343499405, 6528.086067950396, 6531.281559028598, 6546.18172728409, 6332.0818481320875, 6432.035194720642, 6495.837604059936, 6520.771772987922, 6521.967390163209, 6680.899786503109, 6708.094407255153, 6710.060591517289, 6715.764948226984, 6731.124953755981, 4257.27626303523, 4310.0, 4323.3731108988395, 4331.80506877185, 4415.514293427785, 6558.147440832661, 6558.245801732862, 6563.245226798788, 6566.573172743756, 6575.0, 6384.553081284265, 6398.712057957497, 6398.976163813767, 6401.8399540010005, 6401.935980640134, 6264.718087685974, 6366.4083979005245, 6372.936270637234, 6385.265694445198, 6386.0, 6260.874782504416, 6268.373162683695, 6268.561200715906, 6271.874562508633, 6275.3724627536885, 6416.101745755504, 6424.646644434601, 6426.903596446151, 6428.4857211423905, 6429.4856411486035, 6121.571489995657, 6241.625502469867, 6253.624782513064, 6257.624542527463, 6259.217597800275], "yui.html": [853.0914575976584, 862.6376921692888, 870.1211776106132, 875.4134729731081, 887.449781135696, 12903.0, 13256.801147982787, 13264.071514993955, 13271.933640331808, 13291.202527848336, 13378.197308161492, 13407.731845363087, 13461.865381346184, 13464.596062118128, 13470.393832277547, 660.9206895172562, 666.6766618190173, 806.6853926968487, 807.5316316536409, 821.8685010398337, 801.5831767480906, 810.0, 810.4165001199157, 812.8049268175624, 813.5525460996458, 839.6851180807197, 859.6518410043942, 861.8362511122898, 862.2326129744532, 862.482510493705, 697.4385619576265, 701.3092104277283, 837.5477242289156, 850.0946491986015, 855.315747402079, 627.9497640188774, 628.475223188638, 629.2071989293478, 630.180765005491, 632.1055706175756, 12190.634280971584, 12455.12814103013, 12471.438785254595, 12722.193626409919, 12794.552190673281, 11295.887041129567, 11580.247283926517, 11805.114616403804, 12122.090843186796, 12484.75030499394, 9665.951670241675, 10326.277160598762, 10365.429901355423, 10386.376817390905, 10530.210234232463, 3303.8182899940493, 3374.645662205482, 3377.7466689998105, 3394.62659107498, 3455.585329760445, 41242.587574124176, 41433.58566414328, 41451.58548414507, 41566.58433415657, 41668.79165604183, 7551.886721699179, 7556.395488360918, 7573.318401343906, 7638.656260468181, 7645.617719114022, 11409.543618255342, 11517.884821151849, 11521.769564608829, 11542.0, 11561.595344163083, 6599.934000660028, 6710.731570737214, 6737.59574425536, 6754.797356079325, 7145.285471452917, 3986.0832008637594, 3987.182627561343, 4017.397390391465, 4023.91952160961, 4025.7383270087353, 2695.380062585616, 2702.945941081207, 2714.429969706384, 2719.1978366381963, 2720.7551320380867, 430.8728924967142, 433.76143121283167, 438.6688050521836, 451.95706407891197, 452.2966786646796, 535.946405359461, 632.2318383164385, 635.8156134720879, 680.9863802723918, 683.3303362704578, 8052.597370131587, 8165.673373065129, 8408.915910840935, 9241.0, 9570.234381249484, 518.072649956581, 543.9864003399947, 599.3766482857866, 722.3931897206372, 739.3641468337225, 3972.662323702518, 4130.277201489727, 4181.477315335583, 4266.168097221012, 4335.002949321673, 56216.71891640516, 56597.43402565922, 56686.7165664169, 57161.71419142878, 57215.0, 49698.0, 49710.0, 50129.49870501321, 50275.497245027815, 50446.243306350436, 44958.0, 45608.0, 46067.0, 46112.76943615328, 46218.53781462142, 7809.882851757342, 8116.350691944512, 8208.671653133808, 8248.46384984974, 8293.58532073406, 34630.97850811568, 34689.82655086708, 35074.64925350714, 35268.823655881555, 35589.0, 40221.1955760889, 44411.0, 44461.0, 44461.33308000447, 44865.551344487445, 7746.0, 7806.72676456344, 7831.84336313282, 7934.404919631166, 7997.080335761462, 10710.946445267724, 10857.00099304866, 11002.944985275022, 11077.723056923642, 11123.833142502706, 9975.850362244717, 10179.134773544332, 10488.842667359842, 10833.69572280462, 10850.67447976562, 10436.739081523023, 10622.309549879234, 10719.356838589709, 10832.512536936014, 11135.777284454427, 7561.886571701319, 10423.478826058818, 10440.321379110334, 11008.614698485835, 11281.379524126252, 9817.55820988043, 9865.358751681119, 9912.207023437963, 10063.89936100659, 10133.64532241368, 9068.682596109105, 9196.862047069166, 9235.584398702209, 9335.57989890443, 9764.227682724835]}, "summary": {"lowerIsBetter": false, "suite": 6716.675317822497, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 7094.675929483277, "unit": "ms", "value": 7094.675929483277}, "dojo.html": {"lowerIsBetter": false, "filtered": 5397.486126277685, "unit": "ms", "value": 5397.486126277685}, "mootools.html": {"lowerIsBetter": false, "filtered": 4369.271362397649, "unit": "ms", "value": 4369.271362397649}, "ext.html": {"lowerIsBetter": false, "filtered": 19573.146264608902, "unit": "ms", "value": 19573.146264608902}, "prototype.html": {"lowerIsBetter": false, "filtered": 4761.719468972789, "unit": "ms", "value": 4761.719468972789}, "yui.html": {"lowerIsBetter": false, "filtered": 5887.464478476595, "unit": "ms", "value": 5887.464478476595}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-035"}, "testrun": {"date": 1447767190, "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": "20151117030242", "branch": "Firefox", "revision": "898c2c656e4b156c323416ef0c859915f3fd2308"}}, {"talos_counters": {}, "results": {"audio-dft": [161.0, 161.0, 162.0, 162.0, 162.0, 162.0, 161.0, 163.0, 162.0, 164.0], "ai-astar": [109.0, 109.0, 104.0, 110.0, 110.0, 110.0, 100.0, 109.0, 112.0, 109.0], "imaging-gaussian-blur": [109.0, 109.0, 110.0, 110.0, 109.0, 110.0, 110.0, 109.0, 109.0, 109.0], "audio-beat-detection": [150.0, 124.0, 147.0, 174.0, 130.0, 171.0, 148.0, 127.0, 164.0, 126.0], "json-stringify-tinderbox": [69.0, 70.0, 69.0, 70.0, 69.0, 70.0, 69.0, 69.0, 69.0, 70.0], "stanford-crypto-pbkdf2": [149.0, 145.0, 148.0, 150.0, 140.0, 140.0, 150.0, 148.0, 148.0, 154.0], "json-parse-financial": [59.0, 59.0, 57.0, 57.0, 57.0, 57.0, 58.0, 65.0, 55.0, 57.0], "stanford-crypto-sha256-iterative": [66.0, 65.0, 66.0, 67.0, 65.0, 67.0, 66.0, 65.0, 65.0, 65.0], "audio-fft": [72.0, 72.0, 85.0, 93.0, 71.0, 72.0, 72.0, 121.0, 89.0, 71.0], "imaging-darkroom": [145.0, 145.0, 147.0, 145.0, 145.0, 145.0, 146.0, 145.0, 165.0, 145.0], "stanford-crypto-ccm": [118.0, 114.0, 124.0, 115.0, 118.0, 118.0, 123.0, 124.0, 119.0, 130.0], "audio-oscillator": [91.0, 90.0, 135.0, 90.0, 91.0, 91.0, 144.0, 91.0, 91.0, 133.0], "stanford-crypto-aes": [84.0, 85.0, 85.0, 85.0, 89.0, 87.0, 85.0, 86.0, 86.0, 88.0], "imaging-desaturate": [96.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0, 96.0, 96.0, 96.0]}, "summary": {"lowerIsBetter": true, "suite": 1502.3000000000002, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 81.8, "unit": "ms", "value": 81.8}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 147.2, "unit": "ms", "value": 147.2}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 146.1, "unit": "ms", "value": 146.1}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 120.3, "unit": "ms", "value": 120.3}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 147.3, "unit": "ms", "value": 147.3}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 58.1, "unit": "ms", "value": 58.1}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 104.7, "unit": "ms", "value": 104.7}, "ai-astar": {"lowerIsBetter": true, "filtered": 108.2, "unit": "ms", "value": 108.2}, "audio-dft": {"lowerIsBetter": true, "filtered": 162.0, "unit": "ms", "value": 162.0}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 65.7, "unit": "ms", "value": 65.7}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 69.4, "unit": "ms", "value": 69.4}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 109.4, "unit": "ms", "value": 109.4}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 86.0, "unit": "ms", "value": 86.0}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 96.1, "unit": "ms", "value": 96.1}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-035"}, "testrun": {"date": 1447767190, "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": "20151117030242", "branch": "Firefox", "revision": "898c2c656e4b156c323416ef0c859915f3fd2308"}}, {"talos_counters": {}, "results": {"DeltaBlue": [193.6858415649816], "Encrypt": [284.7380410022779], "NavierStokes": [4826.923076923077], "Decrypt": [5035.175879396985], "Splay": [617.5395858708891], "Richards": [165.48072149594572], "RegExp": [25350.0], "Earley": [841.7508417508418], "Boyer": [12280.487804878048], "RayTrace": [1976.2845849802372]}, "summary": {"lowerIsBetter": false, "suite": 19690.59005512586, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 341.3672340000001, "unit": "score", "value": 341.3672340000001}, "Encrypt": {"lowerIsBetter": false, "filtered": 934.8276720000003, "unit": "score", "value": 934.8276720000003}, "NavierStokes": {"lowerIsBetter": false, "filtered": 307.4422310756973, "unit": "score", "value": 307.4422310756973}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.864290419161705, "unit": "score", "value": 52.864290419161705}, "Splay": {"lowerIsBetter": false, "filtered": 131.9607712031558, "unit": "score", "value": 131.9607712031558}, "RegExp": {"lowerIsBetter": false, "filtered": 35.936291913214966, "unit": "score", "value": 35.936291913214966}, "Richards": {"lowerIsBetter": false, "filtered": 213.32998600000002, "unit": "score", "value": 213.32998600000002}, "Earley": {"lowerIsBetter": false, "filtered": 791.7580439999996, "unit": "score", "value": 791.7580439999996}, "Boyer": {"lowerIsBetter": false, "filtered": 54.27007547169812, "unit": "score", "value": 54.27007547169812}, "RayTrace": {"lowerIsBetter": false, "filtered": 374.434434, "unit": "score", "value": 374.434434}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04", "os": "linux", "name": "talos-linux64-ix-035"}, "testrun": {"date": 1447767190, "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": "20151117030242", "branch": "Firefox", "revision": "898c2c656e4b156c323416ef0c859915f3fd2308"}}] 05:53:20 INFO - RETURN: dromaeo_css: 6716.68 05:53:20 INFO - RETURN: kraken: 1502.30 05:53:20 INFO - RETURN: v8_7: 19690.59 05:53:20 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,1,35]]", "result": "19690.59"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,35]]", "result": "1502.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,35]]", "result": "6716.68"}}} 05:53:20 INFO - Return code: 0 05:53:20 INFO - # TBPL SUCCESS # 05:53:20 INFO - Running post-action listener: _resource_record_post_action 05:53:20 INFO - Running post-run listener: _resource_record_post_run 05:53:22 INFO - Total resource usage - Wall time: 1225s; CPU: 13.0%; Read bytes: 8192; Write bytes: 507912192; Read time: 360; Write time: 421724 05:53:22 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 133304320; Read time: 0; Write time: 80888 05:53:22 INFO - run-tests - Wall time: 1211s; CPU: 13.0%; Read bytes: 8192; Write bytes: 316383232; Read time: 360; Write time: 297680 05:53:22 INFO - Running post-run listener: _upload_blobber_files 05:53:22 INFO - Blob upload gear active. 05:53:22 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 05:53:22 INFO - Copying logs to upload dir... 05:53:22 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1257.013913 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2015-11-17 05:53:21.319870) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-17 05:53:21.323245) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010071 build_url: 'https://queue.taskcluster.net/v1/task/wzxk90-xS-yJadElX31mUw/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-17 05:53:21.373770) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:53:21.374099) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1447766498.795170-2004316110 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004481 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:53:21.423590) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-17 05:53:21.423917) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-17 05:53:21.424196) ========= ========= Total master_lag: 0.23 =========