builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-067 starttime: 1447767147.86 results: success (0) buildid: 20151117030242 builduid: c1d8921f683d4290acceb8d8d0acf1d7 revision: 898c2c656e4b156c323416ef0c859915f3fd2308 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:27.856020) ========= 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:27.856499) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:27.856793) ========= 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=3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006479 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:27.876586) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:27.876905) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:27.884600) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:27.884913) ========= 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=3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004420 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:27.933926) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:27.934271) ========= 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:27.934635) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:27.934921) ========= 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=3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-17 05:32:28-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 220M=0s 2015-11-17 05:32:28 (220 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.105175 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:28.052616) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:28.052939) ========= 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=3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020812 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:28.102948) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:28.103295) ========= 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=3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-17 05:32:28,415 truncating revision to first 12 chars 2015-11-17 05:32:28,415 Setting DEBUG logging. 2015-11-17 05:32:28,415 attempt 1/10 2015-11-17 05:32:28,416 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:28,650 unpacking tar archive at: mozilla-central-898c2c656e4b/testing/mozharness/ program finished with exit code 0 elapsedTime=0.520670 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:28.637422) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:28.637768) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:28.758708) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-17 05:32:28.761798) ========= 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:28.762330) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 2 secs) (at 2015-11-17 05:32:28.762616) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:32:29 INFO - MultiFileLogger online at 20151117 05:32:29 in /builds/slave/test-pgo 05:32:29 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --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:29 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 05:32:29 INFO - {'append_to_log': False, 05:32:29 INFO - 'base_work_dir': '/builds/slave/test-pgo', 05:32:29 INFO - 'blob_upload_branch': 'Firefox', 05:32:29 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 05:32:29 INFO - 'branch': 'Firefox', 05:32:29 INFO - 'buildbot_json_path': 'buildprops.json', 05:32:29 INFO - 'config_files': ('talos/linux_config.py',), 05:32:29 INFO - 'default_actions': ('clobber', 05:32:29 INFO - 'read-buildbot-config', 05:32:29 INFO - 'download-and-extract', 05:32:29 INFO - 'populate-webroot', 05:32:29 INFO - 'create-virtualenv', 05:32:29 INFO - 'install', 05:32:29 INFO - 'run-tests'), 05:32:29 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:32:29 INFO - 'download_minidump_stackwalk': True, 05:32:29 INFO - 'download_symbols': 'ondemand', 05:32:29 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:32:29 INFO - 'tooltool.py': '/tools/tooltool.py', 05:32:29 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:32:29 INFO - '/tools/misc-python/virtualenv.py')}, 05:32:29 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:32:29 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:32:29 INFO - 'installer_path': 'installer.exe', 05:32:29 INFO - 'log_level': 'info', 05:32:29 INFO - 'log_name': 'talos', 05:32:29 INFO - 'log_to_console': True, 05:32:29 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:32:29 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:32:29 INFO - 'opt_config_files': (), 05:32:29 INFO - 'pip_index': False, 05:32:29 INFO - 'sps_profile': False, 05:32:29 INFO - 'sps_profile_interval': 0, 05:32:29 INFO - 'suite': 'dromaeojs-e10s', 05:32:29 INFO - 'system_bits': '64', 05:32:29 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:32:29 INFO - 'title': 'talos-linux64-ix-067', 05:32:29 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:32:29 INFO - 'use_talos_json': True, 05:32:29 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 05:32:29 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:32:29 INFO - 'work_dir': 'build'} 05:32:29 INFO - ##### 05:32:29 INFO - ##### Running clobber step. 05:32:29 INFO - ##### 05:32:29 INFO - Running pre-action listener: _resource_record_pre_action 05:32:29 INFO - Running main action method: clobber 05:32:29 INFO - rmtree: /builds/slave/test-pgo/build 05:32:29 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 05:32:29 INFO - Running post-action listener: _resource_record_post_action 05:32:29 INFO - ##### 05:32:29 INFO - ##### Running read-buildbot-config step. 05:32:29 INFO - ##### 05:32:29 INFO - Running pre-action listener: _resource_record_pre_action 05:32:29 INFO - Running main action method: read_buildbot_config 05:32:29 INFO - Using buildbot properties: 05:32:29 INFO - { 05:32:29 INFO - "properties": { 05:32:29 INFO - "buildnumber": 545, 05:32:29 INFO - "product": "firefox", 05:32:29 INFO - "script_repo_revision": "production", 05:32:29 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 05:32:29 INFO - "repository": "", 05:32:29 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 05:32:29 INFO - "buildid": "20151117030242", 05:32:29 INFO - "slavename": "talos-linux64-ix-067", 05:32:29 INFO - "stage_platform": "linux64-pgo", 05:32:29 INFO - "basedir": "/builds/slave/test-pgo", 05:32:29 INFO - "nightly_build": "True", 05:32:29 INFO - "project": "", 05:32:29 INFO - "platform": "ubuntu64_hw", 05:32:29 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 05:32:29 INFO - "slavebuilddir": "test", 05:32:29 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 05:32:29 INFO - "branch": "mozilla-central", 05:32:29 INFO - "repo_path": "mozilla-central", 05:32:29 INFO - "pgo_build": "True", 05:32:29 INFO - "builduid": "c1d8921f683d4290acceb8d8d0acf1d7", 05:32:29 INFO - "revision": "898c2c656e4b156c323416ef0c859915f3fd2308" 05:32:29 INFO - }, 05:32:29 INFO - "sourcestamp": { 05:32:29 INFO - "repository": "", 05:32:29 INFO - "hasPatch": false, 05:32:29 INFO - "project": "", 05:32:29 INFO - "branch": "mozilla-central-linux64-pgo-talos", 05:32:29 INFO - "changes": [ 05:32:29 INFO - { 05:32:29 INFO - "category": null, 05:32:29 INFO - "files": [ 05:32:29 INFO - { 05:32:29 INFO - "url": null, 05:32:29 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:29 INFO - } 05:32:29 INFO - ], 05:32:29 INFO - "repository": "", 05:32:29 INFO - "rev": "898c2c656e4b156c323416ef0c859915f3fd2308", 05:32:29 INFO - "who": "sendchange", 05:32:29 INFO - "when": 1447767080, 05:32:29 INFO - "number": 6671822, 05:32:29 INFO - "comments": "", 05:32:29 INFO - "project": "", 05:32:29 INFO - "at": "Tue 17 Nov 2015 05:31:20", 05:32:29 INFO - "branch": "mozilla-central-linux64-pgo-talos", 05:32:29 INFO - "revlink": "", 05:32:29 INFO - "properties": [ 05:32:29 INFO - [ 05:32:29 INFO - "buildid", 05:32:29 INFO - "20151117030242", 05:32:29 INFO - "Change" 05:32:29 INFO - ], 05:32:29 INFO - [ 05:32:29 INFO - "builduid", 05:32:29 INFO - "c1d8921f683d4290acceb8d8d0acf1d7", 05:32:29 INFO - "Change" 05:32:29 INFO - ], 05:32:29 INFO - [ 05:32:29 INFO - "nightly_build", 05:32:29 INFO - "True", 05:32:29 INFO - "Change" 05:32:29 INFO - ], 05:32:29 INFO - [ 05:32:29 INFO - "pgo_build", 05:32:29 INFO - "True", 05:32:29 INFO - "Change" 05:32:29 INFO - ] 05:32:29 INFO - ], 05:32:29 INFO - "revision": "898c2c656e4b156c323416ef0c859915f3fd2308" 05:32:29 INFO - } 05:32:29 INFO - ], 05:32:29 INFO - "revision": "898c2c656e4b156c323416ef0c859915f3fd2308" 05:32:29 INFO - } 05:32:29 INFO - } 05:32:29 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:29 INFO - Running post-action listener: _resource_record_post_action 05:32:29 INFO - ##### 05:32:29 INFO - ##### Running download-and-extract step. 05:32:29 INFO - ##### 05:32:29 INFO - Running pre-action listener: _resource_record_pre_action 05:32:29 INFO - Running main action method: download_and_extract 05:32:29 INFO - mkdir: /builds/slave/test-pgo/build/tests 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/test_packages.json 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/test_packages.json 05:32:29 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:29 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:29 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:30 INFO - Downloaded 1302 bytes. 05:32:30 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 05:32:30 INFO - Using the following test package requirements: 05:32:30 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 05:32:30 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:30 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 05:32:30 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:30 INFO - u'jsshell-linux-x86_64.zip'], 05:32:30 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:30 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 05:32:30 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 05:32:30 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:30 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 05:32:30 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:30 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 05:32:30 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:30 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 05:32:30 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 05:32:30 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 05:32:30 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 05:32:30 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 05:32:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:30 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:30 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:30 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:30 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:30 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:32 INFO - Downloaded 22463546 bytes. 05:32:32 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:32 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:32:32 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:33 INFO - Return code: 0 05:32:33 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:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:33 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:33 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:33 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:33 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:33 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:41 INFO - Downloaded 22463546 bytes. 05:32:41 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:41 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 05:32:41 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:42 INFO - Return code: 0 05:32:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:42 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:42 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:42 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:42 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:42 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:43 INFO - Downloaded 11131693 bytes. 05:32:43 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:43 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 05:32:43 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:43 INFO - Return code: 0 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 - 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:43 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:43 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:43 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:43 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:47 INFO - Downloaded 57170979 bytes. 05:32:47 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:47 INFO - mkdir: /builds/slave/test-pgo/properties 05:32:47 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 05:32:47 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 05:32:47 INFO - Contents: 05:32:47 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:47 INFO - Running post-action listener: _resource_record_post_action 05:32:47 INFO - Running post-action listener: set_extra_try_arguments 05:32:47 INFO - ##### 05:32:47 INFO - ##### Running populate-webroot step. 05:32:47 INFO - ##### 05:32:47 INFO - Running pre-action listener: _resource_record_pre_action 05:32:47 INFO - Running main action method: populate_webroot 05:32:47 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 05:32:47 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 05:32:47 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 05:32:47 INFO - '../fennec_ids.txt'], 05:32:47 INFO - 'tests': ['tcheck2']}, 05:32:47 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 05:32:47 INFO - '--tppagecycles', 05:32:47 INFO - '7'], 05:32:47 INFO - 'tests': ['tsvgm']}}, 05:32:47 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 05:32:47 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 05:32:47 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:32:47 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:32:47 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 05:32:47 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 05:32:47 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:32:47 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:47 INFO - 'talos_options': ['--e10s'], 05:32:47 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:32:47 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:47 INFO - 'tests': ['damp', 'tps']}, 05:32:47 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:47 INFO - 'talos_options': ['--e10s'], 05:32:47 INFO - 'tests': ['damp', 'tps']}, 05:32:47 INFO - 'g3': {'tests': ['dromaeo_dom']}, 05:32:47 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:32:47 INFO - 'other': {'tests': ['a11yr', 05:32:47 INFO - 'ts_paint', 05:32:47 INFO - 'tpaint', 05:32:47 INFO - 'sessionrestore', 05:32:47 INFO - 'sessionrestore_no_auto_restore']}, 05:32:47 INFO - 'other-e10s': {'talos_options': ['--e10s'], 05:32:47 INFO - 'tests': ['a11yr', 05:32:47 INFO - 'ts_paint', 05:32:47 INFO - 'tpaint', 05:32:47 INFO - 'sessionrestore', 05:32:47 INFO - 'sessionrestore_no_auto_restore']}, 05:32:47 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 05:32:47 INFO - 'tests': ['a11yr', 05:32:47 INFO - 'ts_paint', 05:32:47 INFO - 'tpaint', 05:32:47 INFO - 'sessionrestore', 05:32:47 INFO - 'sessionrestore_no_auto_restore']}, 05:32:47 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 05:32:47 INFO - 'tests': ['a11yr', 05:32:47 INFO - 'ts_paint', 05:32:47 INFO - 'tpaint', 05:32:47 INFO - 'sessionrestore', 05:32:47 INFO - 'sessionrestore_no_auto_restore']}, 05:32:47 INFO - 'other_l64': {'tests': ['a11yr', 05:32:47 INFO - 'ts_paint', 05:32:47 INFO - 'tpaint', 05:32:47 INFO - 'sessionrestore', 05:32:47 INFO - 'sessionrestore_no_auto_restore']}, 05:32:47 INFO - 'other_nol64': {'tests': ['a11yr', 05:32:47 INFO - 'ts_paint', 05:32:47 INFO - 'tpaint', 05:32:47 INFO - 'sessionrestore', 05:32:47 INFO - 'sessionrestore_no_auto_restore']}, 05:32:47 INFO - 'svgr': {'tests': ['tsvgx', 05:32:47 INFO - 'tsvgr_opacity', 05:32:47 INFO - 'tart', 05:32:47 INFO - 'tscrollx', 05:32:47 INFO - 'cart']}, 05:32:47 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 05:32:47 INFO - 'tests': ['tsvgx', 05:32:47 INFO - 'tsvgr_opacity', 05:32:47 INFO - 'tart', 05:32:47 INFO - 'tscrollx', 05:32:47 INFO - 'cart']}, 05:32:47 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:47 INFO - 'tests': ['tp5o']}, 05:32:47 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:47 INFO - 'talos_options': ['--e10s'], 05:32:47 INFO - 'tests': ['tp5o']}, 05:32:47 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:47 INFO - 'talos_options': ['--xperf_path', 05:32:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:32:47 INFO - 'tests': ['tp5n']}, 05:32:47 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 05:32:47 INFO - 'talos_options': ['--e10s', 05:32:47 INFO - '--xperf_path', 05:32:47 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:32:47 INFO - 'tests': ['tp5n']}}, 05:32:47 INFO - 'talos.zip': {'path': '', 05:32:47 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 05:32:47 INFO - Running post-action listener: _resource_record_post_action 05:32:47 INFO - ##### 05:32:47 INFO - ##### Running create-virtualenv step. 05:32:47 INFO - ##### 05:32:47 INFO - Running pre-action listener: _resource_record_pre_action 05:32:47 INFO - Running main action method: create_virtualenv 05:32:47 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 05:32:47 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:47 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 05:32:47 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:32:47 INFO - Using real prefix '/usr' 05:32:47 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 05:32:48 INFO - Installing distribute.............................................................................................................................................................................................done. 05:32:50 INFO - Installing pip.................done. 05:32:50 INFO - Return code: 0 05:32:50 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 05:32:50 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:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:50 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:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:50 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 0x7f674b368c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15be6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x167f3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17088c0>, '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 0x16b5420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16b58b0>, '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': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', '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:50 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:50 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:50 INFO - Using env: {'DISPLAY': ':0', 05:32:50 INFO - 'HOME': '/home/cltbld', 05:32:50 INFO - 'LANG': 'en_US.UTF-8', 05:32:50 INFO - 'LANGUAGE': 'en_US:en', 05:32:50 INFO - 'LOGNAME': 'cltbld', 05:32:50 INFO - 'MAIL': '/var/mail/cltbld', 05:32:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:50 INFO - 'MOZ_NO_REMOTE': '1', 05:32:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:50 INFO - 'NO_EM_RESTART': '1', 05:32:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:50 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:50 INFO - 'SHELL': '/bin/bash', 05:32:50 INFO - 'SHLVL': '1', 05:32:50 INFO - 'TERM': 'linux', 05:32:50 INFO - 'TMOUT': '86400', 05:32:50 INFO - 'USER': 'cltbld', 05:32:50 INFO - 'XDG_SESSION_COOKIE': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', 05:32:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:50 INFO - '_': '/tools/buildbot/bin/python'} 05:32:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:50 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:50 INFO - Cleaning up... 05:32:50 INFO - Return code: 0 05:32:50 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 05:32:50 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:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:50 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:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:50 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 0x7f674b368c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15be6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x167f3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17088c0>, '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 0x16b5420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16b58b0>, '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': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', '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:50 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:50 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:50 INFO - Using env: {'DISPLAY': ':0', 05:32:50 INFO - 'HOME': '/home/cltbld', 05:32:50 INFO - 'LANG': 'en_US.UTF-8', 05:32:50 INFO - 'LANGUAGE': 'en_US:en', 05:32:50 INFO - 'LOGNAME': 'cltbld', 05:32:50 INFO - 'MAIL': '/var/mail/cltbld', 05:32:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:50 INFO - 'MOZ_NO_REMOTE': '1', 05:32:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:50 INFO - 'NO_EM_RESTART': '1', 05:32:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:50 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:50 INFO - 'SHELL': '/bin/bash', 05:32:50 INFO - 'SHLVL': '1', 05:32:50 INFO - 'TERM': 'linux', 05:32:50 INFO - 'TMOUT': '86400', 05:32:50 INFO - 'USER': 'cltbld', 05:32:50 INFO - 'XDG_SESSION_COOKIE': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', 05:32:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:50 INFO - '_': '/tools/buildbot/bin/python'} 05:32:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:50 INFO - Downloading/unpacking psutil>=0.7.1 05:32:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:52 INFO - Creating supposed download cache at /builds/slave/test-pgo/build/venv/cache 05:32:52 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:52 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 05:32:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:32:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:32:52 INFO - Installing collected packages: psutil 05:32:52 INFO - Running setup.py install for psutil 05:32:52 INFO - building 'psutil._psutil_linux' extension 05:32:52 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:52 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:52 INFO - building 'psutil._psutil_posix' extension 05:32:52 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:52 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:52 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:32:52 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:32:52 INFO - Successfully installed psutil 05:32:52 INFO - Cleaning up... 05:32:53 INFO - Return code: 0 05:32:53 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 05:32:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:53 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 0x7f674b368c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15be6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x167f3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17088c0>, '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 0x16b5420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16b58b0>, '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': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', '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:53 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:53 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:53 INFO - Using env: {'DISPLAY': ':0', 05:32:53 INFO - 'HOME': '/home/cltbld', 05:32:53 INFO - 'LANG': 'en_US.UTF-8', 05:32:53 INFO - 'LANGUAGE': 'en_US:en', 05:32:53 INFO - 'LOGNAME': 'cltbld', 05:32:53 INFO - 'MAIL': '/var/mail/cltbld', 05:32:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:53 INFO - 'MOZ_NO_REMOTE': '1', 05:32:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:53 INFO - 'NO_EM_RESTART': '1', 05:32:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:53 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:53 INFO - 'SHELL': '/bin/bash', 05:32:53 INFO - 'SHLVL': '1', 05:32:53 INFO - 'TERM': 'linux', 05:32:53 INFO - 'TMOUT': '86400', 05:32:53 INFO - 'USER': 'cltbld', 05:32:53 INFO - 'XDG_SESSION_COOKIE': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', 05:32:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:53 INFO - '_': '/tools/buildbot/bin/python'} 05:32:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:53 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 05:32:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:54 INFO - Downloading mozsystemmonitor-0.0.tar.gz 05:32:54 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 05:32:54 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:32:54 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:54 INFO - Installing collected packages: mozsystemmonitor 05:32:54 INFO - Running setup.py install for mozsystemmonitor 05:32:55 INFO - Successfully installed mozsystemmonitor 05:32:55 INFO - Cleaning up... 05:32:55 INFO - Return code: 0 05:32:55 INFO - Installing blobuploader==1.2.4 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', '--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 0x7f674b368c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15be6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x167f3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17088c0>, '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 0x16b5420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16b58b0>, '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': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', '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', '--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:55 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: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': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', 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 - Downloading/unpacking blobuploader==1.2.4 05:32:55 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:55 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:55 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:55 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:55 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:55 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:56 INFO - Downloading blobuploader-1.2.4.tar.gz 05:32:56 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:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:32:57 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:32:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:57 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:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 05:32:57 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:32:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:32:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:32:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:32:57 INFO - Downloading docopt-0.6.1.tar.gz 05:32:57 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:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 05:32:57 INFO - Installing collected packages: blobuploader, requests, docopt 05:32:57 INFO - Running setup.py install for blobuploader 05:32:57 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:32:57 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 05:32:57 INFO - Running setup.py install for requests 05:32:58 INFO - Running setup.py install for docopt 05:32:58 INFO - Successfully installed blobuploader requests docopt 05:32:58 INFO - Cleaning up... 05:32:58 INFO - Return code: 0 05:32:58 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:32:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:32:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:32:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:32:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:32:58 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 0x7f674b368c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15be6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x167f3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17088c0>, '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 0x16b5420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16b58b0>, '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': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', '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:58 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:58 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:58 INFO - Using env: {'DISPLAY': ':0', 05:32:58 INFO - 'HOME': '/home/cltbld', 05:32:58 INFO - 'LANG': 'en_US.UTF-8', 05:32:58 INFO - 'LANGUAGE': 'en_US:en', 05:32:58 INFO - 'LOGNAME': 'cltbld', 05:32:58 INFO - 'MAIL': '/var/mail/cltbld', 05:32:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:32:58 INFO - 'MOZ_NO_REMOTE': '1', 05:32:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:32:58 INFO - 'NO_EM_RESTART': '1', 05:32:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:32:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:32:58 INFO - 'PWD': '/builds/slave/test-pgo', 05:32:58 INFO - 'SHELL': '/bin/bash', 05:32:58 INFO - 'SHLVL': '1', 05:32:58 INFO - 'TERM': 'linux', 05:32:58 INFO - 'TMOUT': '86400', 05:32:58 INFO - 'USER': 'cltbld', 05:32:58 INFO - 'XDG_SESSION_COOKIE': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', 05:32:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:32:58 INFO - '_': '/tools/buildbot/bin/python'} 05:32:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:32:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:32:58 INFO - Running setup.py (path:/tmp/pip-GuRFuH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:32:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:32:58 INFO - Running setup.py (path:/tmp/pip-sSI_c3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:32:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:32:58 INFO - Running setup.py (path:/tmp/pip-vZlx8X-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:32:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:32:58 INFO - Running setup.py (path:/tmp/pip-nd66dv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:32:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:32:58 INFO - Running setup.py (path:/tmp/pip-0oTDHs-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:32:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:32:58 INFO - Running setup.py (path:/tmp/pip-pP1GB5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:32:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:32:58 INFO - Running setup.py (path:/tmp/pip-EYjCN5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:32:59 INFO - Running setup.py (path:/tmp/pip-Vfw8j6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:32:59 INFO - Running setup.py (path:/tmp/pip-wf9EAZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:32:59 INFO - Running setup.py (path:/tmp/pip-fPdLgd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:32:59 INFO - Running setup.py (path:/tmp/pip-M__YX6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:32:59 INFO - Running setup.py (path:/tmp/pip-ybfOOW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:32:59 INFO - Running setup.py (path:/tmp/pip-jskE9R-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:32:59 INFO - Running setup.py (path:/tmp/pip-nhoyZo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:32:59 INFO - Running setup.py (path:/tmp/pip-fxkc_Y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:32:59 INFO - Running setup.py (path:/tmp/pip-3BlH3X-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:32:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:32:59 INFO - Running setup.py (path:/tmp/pip-AqJiJy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:32:59 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:32:59 INFO - Running setup.py install for manifestparser 05:32:59 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 05:32:59 INFO - Running setup.py install for mozcrash 05:32:59 INFO - Running setup.py install for mozdebug 05:33:00 INFO - Running setup.py install for mozdevice 05:33:00 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Running setup.py install for mozfile 05:33:00 INFO - Running setup.py install for mozhttpd 05:33:00 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Running setup.py install for mozinfo 05:33:00 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Running setup.py install for mozInstall 05:33:00 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Running setup.py install for mozleak 05:33:00 INFO - Running setup.py install for mozlog 05:33:00 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Running setup.py install for moznetwork 05:33:00 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 05:33:00 INFO - Running setup.py install for mozprocess 05:33:00 INFO - Running setup.py install for mozprofile 05:33:01 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 05:33:01 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 05:33:01 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 05:33:01 INFO - Running setup.py install for mozrunner 05:33:01 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 05:33:01 INFO - Running setup.py install for mozscreenshot 05:33:01 INFO - Running setup.py install for moztest 05:33:01 INFO - Running setup.py install for mozversion 05:33:01 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 05:33:01 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:33:01 INFO - Cleaning up... 05:33:01 INFO - Return code: 0 05:33:01 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:33:01 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:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:33:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:33:01 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:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:33:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:33:01 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 0x7f674b368c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15be6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x167f3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17088c0>, '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 0x16b5420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16b58b0>, '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': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', '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:33:01 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:33:01 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:33:01 INFO - Using env: {'DISPLAY': ':0', 05:33:01 INFO - 'HOME': '/home/cltbld', 05:33:01 INFO - 'LANG': 'en_US.UTF-8', 05:33:01 INFO - 'LANGUAGE': 'en_US:en', 05:33:01 INFO - 'LOGNAME': 'cltbld', 05:33:01 INFO - 'MAIL': '/var/mail/cltbld', 05:33:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:33:01 INFO - 'MOZ_NO_REMOTE': '1', 05:33:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:33:01 INFO - 'NO_EM_RESTART': '1', 05:33:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:33:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:33:01 INFO - 'PWD': '/builds/slave/test-pgo', 05:33:01 INFO - 'SHELL': '/bin/bash', 05:33:01 INFO - 'SHLVL': '1', 05:33:01 INFO - 'TERM': 'linux', 05:33:01 INFO - 'TMOUT': '86400', 05:33:01 INFO - 'USER': 'cltbld', 05:33:01 INFO - 'XDG_SESSION_COOKIE': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', 05:33:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:33:01 INFO - '_': '/tools/buildbot/bin/python'} 05:33:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:33:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:33:01 INFO - Running setup.py (path:/tmp/pip-KPIqAe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 05:33:01 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:33:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:33:01 INFO - Running setup.py (path:/tmp/pip-gzGLAM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 05:33:01 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:33:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:33:01 INFO - Running setup.py (path:/tmp/pip-arSrAO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 05:33:01 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:33:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:33:01 INFO - Running setup.py (path:/tmp/pip-CpTBB4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 05:33:02 INFO - Running setup.py (path:/tmp/pip-8XxDEM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:33:02 INFO - Running setup.py (path:/tmp/pip-bRunAl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:33:02 INFO - Running setup.py (path:/tmp/pip-rSxa_h-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:33:02 INFO - Running setup.py (path:/tmp/pip-YTaxNl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 05:33:02 INFO - Running setup.py (path:/tmp/pip-Ftq6rB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 05:33:02 INFO - Running setup.py (path:/tmp/pip-UiU4Uc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:33:02 INFO - Running setup.py (path:/tmp/pip-UmYc2y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:33:02 INFO - Running setup.py (path:/tmp/pip-CycMpv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:33:02 INFO - Running setup.py (path:/tmp/pip-Sys7ja-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:33:02 INFO - Running setup.py (path:/tmp/pip-BsVyyx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:33:02 INFO - Running setup.py (path:/tmp/pip-7Mduiw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 05:33:02 INFO - Running setup.py (path:/tmp/pip-APJA5p-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 05:33:02 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:33:02 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 05:33:02 INFO - Running setup.py (path:/tmp/pip-A_lq9t-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 05:33:02 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:33:02 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:33:02 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:33:02 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:33:02 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:33:02 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:33:02 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 05:33:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:33:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:33:02 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:33:02 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 05:33:02 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:33:02 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:33:04 INFO - Downloading blessings-1.5.1.tar.gz 05:33:04 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:33:04 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 05:33:04 INFO - Installing collected packages: blessings 05:33:04 INFO - Running setup.py install for blessings 05:33:04 INFO - Successfully installed blessings 05:33:04 INFO - Cleaning up... 05:33:04 INFO - Return code: 0 05:33:04 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 05:33:04 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:33:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:33:05 INFO - Reading from file tmpfile_stdout 05:33:05 INFO - Current package versions: 05:33:05 INFO - argparse == 1.2.1 05:33:05 INFO - blessings == 1.5.1 05:33:05 INFO - blobuploader == 1.2.4 05:33:05 INFO - docopt == 0.6.1 05:33:05 INFO - manifestparser == 1.1 05:33:05 INFO - mozInstall == 1.12 05:33:05 INFO - mozcrash == 0.16 05:33:05 INFO - mozdebug == 0.1 05:33:05 INFO - mozdevice == 0.47 05:33:05 INFO - mozfile == 1.2 05:33:05 INFO - mozhttpd == 0.7 05:33:05 INFO - mozinfo == 0.9 05:33:05 INFO - mozleak == 0.1 05:33:05 INFO - mozlog == 3.0 05:33:05 INFO - moznetwork == 0.27 05:33:05 INFO - mozprocess == 0.22 05:33:05 INFO - mozprofile == 0.27 05:33:05 INFO - mozrunner == 6.11 05:33:05 INFO - mozscreenshot == 0.1 05:33:05 INFO - mozsystemmonitor == 0.0 05:33:05 INFO - moztest == 0.7 05:33:05 INFO - mozversion == 1.4 05:33:05 INFO - psutil == 3.1.1 05:33:05 INFO - requests == 1.2.3 05:33:05 INFO - wsgiref == 0.1.2 05:33:05 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 05:33:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:33:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:33:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:33:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 05:33:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:33:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 05:33:05 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 0x7f674b368c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15be6c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x167f3d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17088c0>, '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 0x16b5420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16b58b0>, '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': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', '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:33:05 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:33:05 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:33:05 INFO - Using env: {'DISPLAY': ':0', 05:33:05 INFO - 'HOME': '/home/cltbld', 05:33:05 INFO - 'LANG': 'en_US.UTF-8', 05:33:05 INFO - 'LANGUAGE': 'en_US:en', 05:33:05 INFO - 'LOGNAME': 'cltbld', 05:33:05 INFO - 'MAIL': '/var/mail/cltbld', 05:33:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:33:05 INFO - 'MOZ_NO_REMOTE': '1', 05:33:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:33:05 INFO - 'NO_EM_RESTART': '1', 05:33:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:33:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:33:05 INFO - 'PWD': '/builds/slave/test-pgo', 05:33:05 INFO - 'SHELL': '/bin/bash', 05:33:05 INFO - 'SHLVL': '1', 05:33:05 INFO - 'TERM': 'linux', 05:33:05 INFO - 'TMOUT': '86400', 05:33:05 INFO - 'USER': 'cltbld', 05:33:05 INFO - 'XDG_SESSION_COOKIE': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', 05:33:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:33:05 INFO - '_': '/tools/buildbot/bin/python'} 05:33:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:33:05 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:33:05 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:33:05 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:33:05 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:33:05 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:33:05 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:33:05 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:33:05 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:33:05 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:33:05 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:33:05 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:33:05 INFO - Cleaning up... 05:33:05 INFO - Return code: 0 05:33:05 INFO - Running post-action listener: _resource_record_post_action 05:33:05 INFO - Running post-action listener: _start_resource_monitoring 05:33:05 INFO - Starting resource monitoring. 05:33:05 INFO - ##### 05:33:05 INFO - ##### Running install step. 05:33:05 INFO - ##### 05:33:05 INFO - Running pre-action listener: _resource_record_pre_action 05:33:05 INFO - Running main action method: install 05:33:05 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 05:33:05 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 05:33:05 INFO - Reading from file tmpfile_stdout 05:33:05 INFO - Detecting whether we're running mozinstall >=1.0... 05:33:05 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 05:33:05 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 05:33:05 INFO - Reading from file tmpfile_stdout 05:33:05 INFO - Output received: 05:33:05 INFO - Usage: mozinstall [options] installer 05:33:05 INFO - Options: 05:33:05 INFO - -h, --help show this help message and exit 05:33:05 INFO - -d DEST, --destination=DEST 05:33:05 INFO - Directory to install application into. [default: 05:33:05 INFO - "/builds/slave/test-pgo"] 05:33:05 INFO - --app=APP Application being installed. [default: firefox] 05:33:05 INFO - mkdir: /builds/slave/test-pgo/build/application 05:33:05 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:33:05 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:19 INFO - Reading from file tmpfile_stdout 05:33:19 INFO - Output received: 05:33:19 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 05:33:19 INFO - Running post-action listener: _resource_record_post_action 05:33:19 INFO - ##### 05:33:19 INFO - ##### Running run-tests step. 05:33:19 INFO - ##### 05:33:19 INFO - Running pre-action listener: _resource_record_pre_action 05:33:19 INFO - Running main action method: run_tests 05:33:19 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 05:33:19 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 05:33:19 INFO - Python 2.7.3 05:33:19 INFO - Return code: 0 05:33:19 INFO - grabbing minidump binary from tooltool 05:33:19 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:19 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 0x17088c0>, '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 0x16b5420>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16b58b0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 05:33:19 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:19 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:20 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:33:20 INFO - Return code: 0 05:33:20 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 05:33:20 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 05:33:20 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 05:33:20 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 05:33:20 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 05:33:20 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-e10s', '--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-067', '--webServer', 'localhost'] in /builds/slave/test-pgo/build 05:33:20 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-e10s --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-067 --webServer localhost 05:33:20 INFO - Using env: {'DISPLAY': ':0', 05:33:20 INFO - 'HOME': '/home/cltbld', 05:33:20 INFO - 'LANG': 'en_US.UTF-8', 05:33:20 INFO - 'LANGUAGE': 'en_US:en', 05:33:20 INFO - 'LOGNAME': 'cltbld', 05:33:20 INFO - 'MAIL': '/var/mail/cltbld', 05:33:20 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:33:20 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 05:33:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:33:20 INFO - 'MOZ_NO_REMOTE': '1', 05:33:20 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 05:33:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:33:20 INFO - 'NO_EM_RESTART': '1', 05:33:20 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:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 05:33:20 INFO - 'PWD': '/builds/slave/test-pgo', 05:33:20 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 05:33:20 INFO - 'SHELL': '/bin/bash', 05:33:20 INFO - 'SHLVL': '1', 05:33:20 INFO - 'TERM': 'linux', 05:33:20 INFO - 'TMOUT': '86400', 05:33:20 INFO - 'USER': 'cltbld', 05:33:20 INFO - 'XDG_SESSION_COOKIE': '3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301', 05:33:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:33:20 INFO - '_': '/tools/buildbot/bin/python'} 05:33:20 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-e10s', '--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-067', '--webServer', 'localhost'] with output_timeout 3600 05:33:20 INFO - mozversion INFO | application_buildid: 20151117030242 05:33:20 INFO - mozversion INFO | application_changeset: 898c2c656e4b156c323416ef0c859915f3fd2308 05:33:20 INFO - mozversion INFO | application_display_name: Nightly 05:33:20 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:33:20 INFO - mozversion INFO | application_name: Firefox 05:33:20 INFO - mozversion INFO | application_remotingname: firefox 05:33:20 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/mozilla-central 05:33:20 INFO - mozversion INFO | application_vendor: Mozilla 05:33:20 INFO - mozversion INFO | application_version: 45.0a1 05:33:20 INFO - mozversion INFO | platform_buildid: 20151117030242 05:33:20 INFO - mozversion INFO | platform_changeset: 898c2c656e4b156c323416ef0c859915f3fd2308 05:33:20 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/mozilla-central 05:33:20 INFO - mozversion INFO | platform_version: 45.0a1 05:33:20 INFO - 2015-11-17 05:33:20,224 DEBUG : using testdate: 1447767200 05:33:20 INFO - 2015-11-17 05:33:20,224 DEBUG : actual date: 1447767200 05:33:20 INFO - 2015-11-17 05:33:20,271 INFO : starting webserver on 'localhost:45009' 05:33:20 INFO - 2015-11-17 05:33:20,272 INFO : Starting test suite talos-linux64-ix-067.e 05:33:20 INFO - 2015-11-17 05:33:20,273 INFO : Starting test dromaeo_css 05:33:20 INFO - 2015-11-17 05:33:20,273 DEBUG : operating with platform_type : linux_ 05:33:20 INFO - 2015-11-17 05:33:20,273 INFO : Initialising browser for dromaeo_css test... 05:33:20 INFO - 2015-11-17 05:33:20,289 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpRyXLIH/profile http://localhost:45009/getInfo.html 05:33:25 INFO - 2015-11-17 05:33:25,173 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:33:25 INFO - 2015-11-17 05:33:25,173 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:33:25 INFO - 2015-11-17 05:33:25,173 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/668 05:33:25 INFO - 2015-11-17 05:33:25,173 DEBUG : BROWSER_OUTPUT: __metrics 05:33:26 INFO - 2015-11-17 05:33:26,185 INFO : Browser initialized. 05:33:26 INFO - 2015-11-17 05:33:26,186 INFO : Running cycle 1/1 for dromaeo_css test... 05:33:26 INFO - 2015-11-17 05:33:26,186 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpRyXLIH/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:33:37 INFO - 2015-11-17 05:33:37,926 DEBUG : BROWSER_OUTPUT: RSS: Main: 141574144 05:33:37 INFO - 2015-11-17 05:33:37,926 DEBUG : BROWSER_OUTPUT: 05:34:27 INFO - 2015-11-17 05:34:27,544 DEBUG : BROWSER_OUTPUT: 1447767267542 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:36 INFO - 2015-11-17 05:36:36,199 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/dromaeo/cssquery-dojo.html (next: http://localhost:45009/tests/dromaeo/cssquery-ext.html) 05:36:37 INFO - 2015-11-17 05:36:37,276 DEBUG : BROWSER_OUTPUT: RSS: Main: 146710528 05:36:37 INFO - 2015-11-17 05:36:37,276 DEBUG : BROWSER_OUTPUT: 05:39:39 INFO - 2015-11-17 05:39:39,100 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/dromaeo/cssquery-ext.html (next: http://localhost:45009/tests/dromaeo/cssquery-jquery.html) 05:39:39 INFO - 2015-11-17 05:39:39,681 DEBUG : BROWSER_OUTPUT: RSS: Main: 141881344 05:39:39 INFO - 2015-11-17 05:39:39,681 DEBUG : BROWSER_OUTPUT: 05:42:41 INFO - 2015-11-17 05:42:41,321 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/dromaeo/cssquery-jquery.html (next: http://localhost:45009/tests/dromaeo/cssquery-mootools.html) 05:42:41 INFO - 2015-11-17 05:42:41,902 DEBUG : BROWSER_OUTPUT: RSS: Main: 142159872 05:42:41 INFO - 2015-11-17 05:42:41,902 DEBUG : BROWSER_OUTPUT: 05:45:43 INFO - 2015-11-17 05:45:43,546 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/dromaeo/cssquery-mootools.html (next: http://localhost:45009/tests/dromaeo/cssquery-prototype.html) 05:45:44 INFO - 2015-11-17 05:45:44,132 DEBUG : BROWSER_OUTPUT: RSS: Main: 139571200 05:45:44 INFO - 2015-11-17 05:45:44,132 DEBUG : BROWSER_OUTPUT: 05:48:46 INFO - 2015-11-17 05:48:46,373 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/dromaeo/cssquery-prototype.html (next: http://localhost:45009/tests/dromaeo/cssquery-yui.html) 05:48:46 INFO - 2015-11-17 05:48:46,987 DEBUG : BROWSER_OUTPUT: RSS: Main: 141643776 05:48:46 INFO - 2015-11-17 05:48:46,987 DEBUG : BROWSER_OUTPUT: 05:51:49 INFO - 2015-11-17 05:51:49,364 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/dromaeo/cssquery-yui.html (next: http://localhost:45009/tests/dromaeo/cssquery-dojo.html) 05:51:49 INFO - 2015-11-17 05:51:49,610 DEBUG : BROWSER_OUTPUT: RSS: Main: 143872000 05:51:49 INFO - 2015-11-17 05:51:49,610 DEBUG : BROWSER_OUTPUT: 05:51:49 INFO - 2015-11-17 05:51:49,611 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:51:49 INFO - 2015-11-17 05:51:49,611 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:51:49 INFO - 2015-11-17 05:51:49,612 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:51:49 INFO - 2015-11-17 05:51:49,612 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:51:49 INFO - 2015-11-17 05:51:49,615 DEBUG : BROWSER_OUTPUT: |0;dojo.html;3241.9513707294395;3316.883909063183;3321.2195134143485;3355.4295769719147;3358.412277851377;5341;5439.102548079572;5475.178723191523;5524.944750552493;5526.226328314035;5335.919961200585;5370.865728356793;5429.375621803484;5447.809326673567;5506.119020956648;5011.42368627607;5015.32293140425;5061.974690126544;5081.720505372203;5085.618578606619;5038.2190760432195;5051.494850514938;5082.364704411949;5092.8472145835685;5098.337216161894;4897.02059588082;4951.059298733229;5004.924926126129;5014.548690617826;5014.749262536895;5065.746712664389;5075.289459475676;5083.618728595333;5129.25625784263;5147.948520514822;4966.180580204262;5072.594192464594;5083.61872859537;5094.923576146361;5098.694078355274;5327.413984461706;5340.786368545254;5345.812896548602;5346.97326513365;5431.321084864392;5917.674527900964;5966.8209953701025;5969.970150149265;5974.761009559613;5992.8501787455225;5830.708464576796;5881.206037184968;5923.733431995527;5970.402959704038;6002.609830361012;5586.329640443132;5599.580031497654;5604.579656525736;5605.971970140164;5683.090705487143;6050.515958723292;6056.152138700585;6061.333253342129;6064.06007068905;6067.484263837535;5606.159076138611;5762.078067509178;5765;5792.420757924174;5885.646861188342;5838.883222335529;5845.7369418376275;5877.529797616266;5931.6441013539325;5960.493358064527;5873.2658417697785;5874.794382196603;5880;5898.793542226002;6054.636721796706;5765.913511297334;5818.738156782955;5835.037218858841;5864.9413505864395;5888.676122813286;4555.06621142665;4615.8846028848875;4621.630269578425;4641.8375356863025;4667.789949452283;4023.136756885474;4033.717639765247;4069.877903662895;4088.2845502037026;4092.7748973806724;5541.501264886179;5592;5623.578231632644;5680.6591604503865;5719.857003574861;6033.155358249848;6051.788187413419;6066.575339726265;6073.119397687311;6082.635041897412;5738.053221218453;5739.339975902742;5739.827805165852;5757.481826635623;5759.280089988752;5063.873403164876;5109.463506331856;5150.922736158961;5243.872567398028;5257.526822585985;6170.50635949123;6234.594751341148;6258.874822503524;6264.310925798159;6270.561060725706;5990.820275391745;6032.4570788629235;6033.487153591818;6037.577369584087;6040.305364883095;5869.383714710065;6021.939780602138;6055.515558755377;6140.631562106288;6155.84610384744;5861.501772349398;5907.556933229939;5922.2597175353085;5922.703864806656;5924.526037917042;5741.540676745767;5973.880522389615;5993.790217342372;5994.910076348945;6004.579679422399;5712.971435142964;5735.9139612905;5799.652020878761;5817.127430885401;5838.416158384128;5657.943420565742;5704.572157088152;5709.172170035238;5711.257536520226;5734.827955161351;5568.77724891016;5616.803411880564;5659.094544872801;5673.177389278449;5790.507806836466;5774.04728219839;5788.942110578841;5822.243108395882;5837.387074357302;5878.853028674317;5648.350439699487;5709.286339207599;5711.428857114422;5726.685032323262;5741.13882917549 05:51:49 INFO - 2015-11-17 05:51:49,615 DEBUG : BROWSER_OUTPUT: |1;ext.html;575.8848230353929;581.1428143488354;597.345906232675;607.820692895596;644.5584774429514;38989.41515877261;39849.80075099624;39927.40108898365;40058.59941400593;40235.79882100593;41087;41805.37291940623;41857.16285674285;41870;41891.58108418922;8554.95722521388;8748.518831464267;8753.3872628916;8777.605007774633;8787.297016238686;8275.710350137746;8459.703910363138;8542;8564.443311184754;8564.443311184785;8394.202550757669;8508.191721786452;8512.1487851215;8549.230569248766;8577.785555361104;8522.892024036897;8558.058613552505;8593.484390936565;8600.8709869352;8620.82758344836;8320.958395207985;8393.748187554322;8423;8432.198941100647;8473.110323416015;37942.43086353679;38399.616003840165;38428.42357364642;38471.61528384708;38536.03659908497;3357;3403.5235067090625;3468.8959331219853;3886.3198940185353;4201;29458.558121628193;29727;30026.549601755993;30804.537931931038;31167.844160779277;3664;3666.1018050577513;3680.4847321375028;3712.3874560697454;3802.790846503441;265910;265989;266809;266864;267487;42072.57927420748;42080.158396831896;56360.71819640957;57136;57214.7139264301;40665.763383014215;40782.79608601938;41140.794296028325;41213;41219.58780412217;14663.633409164857;14749.188794616184;14894.70210595782;14905.403783848742;14966.102033878002;11416.972472477517;11430.314181149157;11443.141764367705;11455.942720286344;11509.079273658088;13764.862351376358;14067;14273.85726142746;14284.642883927778;14360.281985900663;5912.556558258148;5959.28488581373;5983.820485385445;6020.458158765732;6040.86200952349;908.5502676175204;983.3362480325894;1029.8455231715302;1041.7135287795916;1126.8929451702074;28477.715222847506;28744.856275718488;28869.855650721613;28871;28888;1080.5893760371166;1115.4199816095747;1167.3171194850938;1195.3126952002633;1213.7997230456876;14928;14996.550103496913;15079.472218472301;15122.319495622723;15129.47046853377;305194;308877;310211;310962;311480;51740;51769;51797;51854;52334;1327.6415367850818;1332.6535100873648;1344.8184495093233;1349.595121463557;1356.274393199653;27279.318017049733;27777.861110694317;28438;28575.857120715096;28800.711992879802;46411.303830441895;46837.2974405391;46841;46923;46932.29601555911;299753;300032;301129;302850;303000;32140.517892231168;32545;32820.507692384155;32995.67004329926;33048.33903321968;43319.00300688378;43320.78339608408;43941.560584393745;43993.78003109964;44215;37111.81444092762;37797.62202377941;37829.43255851109;37927.45182269588;38510.80744596259;36472.27055458929;37099.81450092732;37135.44296835495;37903.43144852885;37929.62070379371;36231.27537449289;36410;36562.63437365592;36572;36670.633293666724;32105.67894321027;33657.495137573445;33702;34226.315473690884;34247;25450.490990180464;25546.616800747634;25768.61347079758;25873.22380328593;26128.60807087933 05:51:49 INFO - 2015-11-17 05:51:49,619 DEBUG : BROWSER_OUTPUT: |2;jquery.html;346.2583206471449;349.1289233362757;349.43042840170534;351.25533868199415;351.7291685402239;14526.709465810678;14574;17095.914520427395;17539;18510.814891851096;17045.931732288183;17379.82620173798;17390.82609173908;17765.378211762592;17908;5244.239585260135;5327.307450031491;5343.385510666284;5362.249285100089;5367.973160134214;5238.8690282742855;5361.544268737162;5365.517103460687;5372.892542149155;5377.193420986864;5287.206918962148;5291.100512912814;5295.4969277918535;5296.967091417175;5296.993571221475;5174.456682048369;5226.2944502492055;5277.868053298679;5285.841424757245;5291.417944026154;4645.256758918556;4645.488996210414;4649.976750116261;4656.4877863434995;4657.324687920266;20709.792902070938;20932.790672093237;20984.5803083939;21013.369598912057;21173;2184.322859913416;2314.305708287524;2332.8833558322185;2369.7393286738443;2437.1348171399077;13083.215007099605;13360;13428.261445620486;13523.932380338134;13607.863921360859;1846.2891786662096;1900.8099190080882;1909.598984213317;1913.7512123423867;1917.4726950088698;58696.41303586952;60542.69728651373;62029.37970620281;62150.68924655393;62858.0571291431;9476.147146756686;9645.71062868115;9887.653932112342;9910.653127140515;9927.106560409598;8173.79565510867;8258.463199891989;8290.751277461686;12538;12584.4337004835;5656.830295091154;5730.627509211888;5800.709964501758;5867.70661466925;5892.6759028253855;6066.150738896558;6067.514598832083;6072.939270607326;6077.392260773976;6106.419890110433;3265.1184180271193;3272.9345413091605;3284.3431313737346;3303.240254741423;3323.202431416491;1151.5336288803048;1160.4661855546542;1164.1036401970434;1166.4984056855633;1221.4198255828587;426.3860041540172;441.3071477779855;458.410941939606;463.89098561837943;475.6860472088405;10723.46382680863;10982.95661912117;11184.664460066211;11307.208495405243;11788.29270243788;428.4580006292043;439.9538048504925;449.8290649553149;457.4464897474094;458.0906899803887;5693.373728889819;5875.6180848245585;6025.698715064317;6052.697365131814;6145.477634401037;533550;541372;542507.1498570007;548333;548645;79964;82697;82875;83289.58355208306;83377.58311208404;485.75712143928035;487.16451286044605;491.89670169264855;492.19280380176536;492.8619986403813;10375;10414.687559373231;10489.423081730578;10563.313384629975;10666.626668066581;33223.501647475794;35230.47154292637;35375.11562210965;36339.091522712144;39425.80287098661;48395.758021209665;49044.75477622589;49356.75321623369;49874.25188622246;50090;8313.958430207811;8364.665413383396;8509.149085091442;8516.829663406821;8562.48625082497;11991.76016479683;12093.274403535816;12266.570670026505;12304.200226985575;12402.503899843905;10729.141668666332;10732.409717465302;11004.119670426187;11026.614068507564;11071.778564428505;10427.582896684047;10776.515056822305;10874;11003.944980275048;11099.278546894426;9870.161036311994;11015.173861960226;11313.377764222718;11320.377379243891;11361.943190283995;8339;8360.038595561346;8481.40630155883;8485.660573576988;8517.190866867637;10742.73143171427;10915.78168436611;10951.288166269167;10998.175136864607;11009.889901100887 05:51:49 INFO - 2015-11-17 05:51:49,622 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1417.4755340524005;1474.8303945046323;1590.5228431470555;1628.5928517870532;1725.1719174796096;7086.716531338747;7281.089863767029;7316.341529262365;7358.96320518398;7437.739679111232;7602.3918086553085;7706.306432421081;7764.495307804988;7768.6115694215205;7774.8445031099345;2252.324302709185;2274.73840508342;2282.0985710644286;2283.5204607032542;2284.120613563773;2282.1327895399727;2322.140807901079;2345.929622111331;2350.4476448034698;2350.71791385034;2268.115434980359;2275.8975846086882;2275.920342788003;2287.451011757183;2317.9304620861403;2272.1479445208047;2283.315005498352;2300.1834348806183;2300.8504447210876;2302.033146078651;2316.513532158249;2330.883455827202;2337.520808234308;2353.1411034972284;2355.740868504463;7618.123915749649;7640.388768898475;7658.425618078666;7658.693652253904;7703.768886933401;4612.884677883047;4682.063587282557;4682.555157260055;4684.3910291662205;4689.62483001359;3177.094528059492;3180.904572862818;3232.127325622069;3242.416365054289;3260.396826587089;1057.5188289328337;1065.1053115383038;1074.2856000759487;1086.1582273737915;1108.6009036746764;10161.695149145537;10176.79646407075;10236.129928955974;10297.433641149808;10373.325733827278;4084.9795751021647;4099.97950010248;4118.546959834416;4185.560516145822;4193.958060419418;8499.150084991576;8522.914770852336;8539.359548033923;8558.957205213934;8581.056083830774;4529;4565.360849481075;4572.337011133433;4592.196365636067;4594.770261486912;4130.091379896418;4185.288500954845;4212.178625168062;4236.91526169481;4242.981684395722;3473.4616134499192;3490.89527314181;3510.684038436553;3518.3666939950544;3531.646835316448;1093.5953697132113;1114.7046032801313;1115.9163062770324;1117.5529788084832;1123.6516679829278;1299.91550549214;1310.8492523359935;1325.350578216667;1327.5353626230742;1343.395472037587;6987.475939304471;6994.405475534637;7129.429645628441;7160.749373771893;7179.174394944648;489.5789620926001;495.3857217050831;495.80911349130844;498.8303976647957;510.3187245027855;5528.834134975958;5534.889302213933;5555.194496798023;5582.051051321285;5585.525230355384;8751.606177722018;8792.516411597295;8943.731688049369;9012.594433250519;9097.13577210164;8912.688055918012;8913.866292005625;8928.553572321358;8941.329400295004;9017.864732029026;7099.2545782693105;7118;7122.92877071233;7129.857402851914;7153.535020223669;7004.894926576208;7014.368706816411;7056.929430705833;7064.116985376828;7070.257622949722;7695;7919.208079192034;7927.128015918129;8002.9599852000365;8081.83836323282;8009.199080091944;8095.311898488459;8125.268725814705;8250.339972802041;8280.958595206985;6786.69459874297;6797.1843378794865;6939.375456208965;6948.062011628365;6951.965240173767;7460.29127232912;7506.474546781673;7514.436417268617;7550.395968322411;7557.093148821957;6827.658617069226;7107.289271072851;7111.857762844611;7156.248593897774;7196.10048743907;6852.554583952027;6875.724971001104;6916.965415172892;6948.409385202112;6986.580805151707;6533.934660653523;6732.057511948233;6759.425448836904;6921.826954326182;6932.202796678446;6356.555041147075;6396.200474940632;6402.487800976004;6406.135171751754;6427.3251308611925;6252.687365631609;6267;6277.686115694106;6350.269718982377;6371.458426033839 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: |4;prototype.html;330.4151651576709;333.1903474556829;337.6286085306162;339.8080084752116;341.43492519879595;6277.403646653572;6292.8741425171465;6294.748210071597;6367.522435817309;6527.151470308865;6279.434850863421;6342.556021078526;6352.777652782153;6365.554411191219;6378.425941665249;4798.232282834756;4798.928016079762;4802.927956080644;4806.471288158317;4807.471178170398;4805.951940480585;4810.807567697288;4817.51824817519;4818;4821.252705830602;4657.371254880599;4724.7401392923375;4725;4741.407324084489;4743.217369134089;4724.362211101509;4728.527147285261;4730.526947305277;4733.242681171013;4741.454732705714;4091.5499295077516;4094.2016306820183;4095.9385609215888;4096.549379568275;4100;6010.879782404328;6028.457438830526;6029.758809647653;6035.7283922223605;6054.545909056795;5363;5477.972610136924;5492.505674489315;5493.697846618435;5506.559475241971;6674.098996635441;6689.632070236135;6703.664816759191;6706.2287836898895;6744.49416293775;4466.0844526871915;4471.150481408522;4471.306947423154;4472.373867658531;4472.463304403493;6789.7284108635595;6818.965905170492;6900.275471075515;6951.6871740771785;6972.710048641017;4482.551744825491;4488.259437192892;4492.9775351123035;4504.684672072989;4505.324201369821;4537.115262523776;4539.523350048264;4547.136044151601;4553.157665831765;4568.565986231302;5375.19372094189;5412.134058550613;5412.539934105645;5413.593980451482;5419.3225846769155;6495.902561461582;6718.764843230463;6745.797626071226;6751.763688270887;6781.389674929182;1615.5072702825516;1662.2353717290182;1676.312711788161;1678.5300115967548;1683.2425408566194;1040.360178490223;1042.5412818360048;1048.0619845238468;1050.6952983634812;1063.2982231727178;6242.656653883989;6251.12484252205;6257.78097766576;6261.530385221035;6285.59143655661;6702.664866756642;6723.630200339028;6764.594124352555;6774.559653622498;6776.288489708608;6249.9062514062325;6271.090691849748;6372.904406433907;6377.362263773678;6377.8724425512155;3740.9438858417147;3752.568454627698;3770.132869440044;3776.9244615107546;3778.9244215115546;7121.750738724119;7171.247019063027;7205.675744591506;7210.315020073084;7218.169910460364;6944.895826562605;7047.859042819115;7097.609631470215;7118.822029449201;7119.71521139159;7155.642217889189;7168.17565979919;7173.282671732889;7177.461690373243;7194.676239569232;6857.862842743217;6879.071325371011;6884.862302754017;6887.552309099892;6915.135608048994;6685.298043705341;6708.966455167693;6774;6795.694193761194;6884.621345826027;7240.96379518099;7291.744788932362;7317.817054573466;7328.816779580553;7334.486585938933;4524.276115821453;4550.499445061107;4556.088782243631;4558.840440584696;4574.199515084913;6847.691853866489;6925.342092501204;6950.6177160256675;6986.126734158231;7025.297470252934;6821.693023813841;6831.897521537082;6832.282610325844;6832.897506537306;6847.965760171167;6816.216135144522;6820.829479263058;6834.043233947351;6841.076454678555;6841.24746277919;6572.211334639683;6686.29793871656;6696.732130714717;6699.933000670126;6709.899351509634;6823.727050917908;6828.7268509259075;6843.247242803188;6850.554713943578;6852.6231057292325;6661.233958094687;6662.067310576426;6674.599524028574;6674.8998765017595;6680.966595166993 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: |5;yui.html;760.4030835793901;814.4258297899981;857.7812657772267;871.9433236839601;884.1026358246377;14771.261436928151;15286.464973725922;15303.464378746747;15330.540083797476;15339.616509587251;14137.222452765094;14202.218877961708;14236.430542778277;14259.857401426008;14271.286435678227;808.5027707959607;811.0834756724893;817.7791996161033;817.8568750468673;818.5620692929284;801.4630197767481;803.0203152154362;804.5132694719698;805.6414895371562;807.1766797866173;845.4166625028711;849.7280870121564;849.732334314692;853.1298075962515;855.4439614250756;833.2917020532559;835.1481488881368;836.5273620404482;842.4397775479299;843.8481073406784;618.9969050154765;621.273110460762;624.2353117431156;625.0624063904144;625.7841044839523;13063.608091757262;13089.541866034739;13132.934335328358;13166.736665266737;13276.73446531064;10528.626230276885;10648.14814814813;10705.357678539312;11065.723356916062;11105.056070234039;9759.90240097597;9995.750106247402;10069.446180460072;10211.693649190536;10436.582536698523;3294.5222942673417;3308.983455082733;3336.2993771308056;3435.1068722132177;3447.0348302475345;45988.3101753474;46194.307085393746;46301.30548041782;46317.30524042142;46397.53602463966;7549.773506794805;7587.165411804807;7652.69389224436;7696.499727517694;7807.492512986638;12157.817632735516;12176.39118044112;12187.45156467961;12200.938995304967;12230.266184028987;6802.761903333459;6816.488763342769;6876.862462750717;6979.267176946449;7068.540544864567;4310.663694254791;4348.304271316574;4354.847580334736;4429.7120687155875;4435.645148388121;2720.6735191777116;2750.2849259192753;2753.2428582139673;2753.408017276295;2758.6413766210667;433.3240145373165;433.55777107350957;442.8295106384001;443.09829496973504;452.8550863723577;631.3528633151057;657.1161787395945;676.9356911093438;691.1498856406648;703.5637904499243;8927.73216803484;9292.442453452815;9472.384295020802;9569.473678947725;9595.760105997406;594.7799314253754;615.6561050085214;694.6144889586328;701.8631366883511;707.8336590901134;4045.514538255369;4079.8572049978106;4087.6116768906904;4100.835966561304;4182.247195504778;59913.704746239375;60412.395876041555;60623.69688151531;60634.39365606287;60655.69672151611;47184.5281547187;47903.28145077827;47993.76003120032;48489.272660910116;48830.26754598684;46451.30323045157;47029;47343.76328118406;47467.28799068017;48120.518794812306;8815.294776417999;9094.909050909406;9111.134442227978;9121.863172052557;9200.171984521425;34861.65138348584;35039.299214016086;35060;35632.46551301681;35884;41507.792461037505;47136.29295560638;47423.28865066958;47644.52355476401;48408.75795620999;8191.549464779256;8265.173482651928;8342.708005219789;8412.957935210285;8741.388102832741;12165.452554634885;12377.381130943597;12410.503579857066;12446.751064978831;13021.283829389096;10840.837387439353;10906.836397454203;11093.611723589636;11447.313161210353;11549.307041577533;11875.52497900109;11917.34454605005;12191.634250972485;12608.243505389706;12621.116521843383;10291.53688084023;11095;11128.88871111311;11214.719632009264;11432.885671143182;9564.139227469283;9654.469004204837;9686.56410461545;9713.854292185764;9816.803663926825;8545.916457452726;8793.824123517366;9000.279977601907;9565.569549370155;9797.755056123653 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,280 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: __startTimestamp1447768309610__endTimestamp 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: Number of tests: 6 05:51:49 INFO - 2015-11-17 05:51:49,623 DEBUG : BROWSER_OUTPUT: 05:51:49 INFO - 2015-11-17 05:51:49,624 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:5512.48 Median:5719.86 stddev:610.67 (10.7%) stddev-sans-first:585.99 05:51:49 INFO - 2015-11-17 05:51:49,624 DEBUG : BROWSER_OUTPUT: Values: 3242.0 3316.9 3321.2 3355.4 3358.4 5341.0 5439.1 5475.2 5524.9 5526.2 5335.9 5370.9 5429.4 5447.8 5506.1 5011.4 5015.3 5062.0 5081.7 5085.6 5038.2 5051.5 5082.4 5092.8 5098.3 4897.0 4951.1 5004.9 5014.5 5014.7 5065.7 5075.3 5083.6 5129.3 5147.9 4966.2 5072.6 5083.6 5094.9 5098.7 5327.4 5340.8 5345.8 5347.0 5431.3 5917.7 5966.8 5970.0 5974.8 5992.9 5830.7 5881.2 5923.7 5970.4 6002.6 5586.3 5599.6 5604.6 5606.0 5683.1 6050.5 6056.2 6061.3 6064.1 6067.5 5606.2 5762.1 5765.0 5792.4 5885.6 5838.9 5845.7 5877.5 5931.6 5960.5 5873.3 5874.8 5880.0 5898.8 6054.6 5765.9 5818.7 5835.0 5864.9 5888.7 4555.1 4615.9 4621.6 4641.8 4667.8 4023.1 4033.7 4069.9 4088.3 4092.8 5541.5 5592.0 5623.6 5680.7 5719.9 6033.2 6051.8 6066.6 6073.1 6082.6 5738.1 5739.3 5739.8 5757.5 5759.3 5063.9 5109.5 5150.9 5243.9 5257.5 6170.5 6234.6 6258.9 6264.3 6270.6 5990.8 6032.5 6033.5 6037.6 6040.3 5869.4 6021.9 6055.5 6140.6 6155.8 5861.5 5907.6 5922.3 5922.7 5924.5 5741.5 5973.9 5993.8 5994.9 6004.6 5713.0 5735.9 5799.7 5817.1 5838.4 5657.9 5704.6 5709.2 5711.3 5734.8 5568.8 5616.8 5659.1 5673.2 5790.5 5774.0 5788.9 5822.2 5837.4 5878.9 5648.4 5709.3 5711.4 5726.7 5741.1 05:51:49 INFO - 2015-11-17 05:51:49,624 DEBUG : BROWSER_OUTPUT: 05:51:49 INFO - 2015-11-17 05:51:49,624 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:45503.50 Median:37105.81 stddev:76543.09 (206.3%) stddev-sans-first:76683.48 05:51:49 INFO - 2015-11-17 05:51:49,625 DEBUG : BROWSER_OUTPUT: Values: 575.9 581.1 597.3 607.8 644.6 38989.4 39849.8 39927.4 40058.6 40235.8 41087.0 41805.4 41857.2 41870.0 41891.6 8555.0 8748.5 8753.4 8777.6 8787.3 8275.7 8459.7 8542.0 8564.4 8564.4 8394.2 8508.2 8512.1 8549.2 8577.8 8522.9 8558.1 8593.5 8600.9 8620.8 8321.0 8393.7 8423.0 8432.2 8473.1 37942.4 38399.6 38428.4 38471.6 38536.0 3357.0 3403.5 3468.9 3886.3 4201.0 29458.6 29727.0 30026.5 30804.5 31167.8 3664.0 3666.1 3680.5 3712.4 3802.8 265910.0 265989.0 266809.0 266864.0 267487.0 42072.6 42080.2 56360.7 57136.0 57214.7 40665.8 40782.8 41140.8 41213.0 41219.6 14663.6 14749.2 14894.7 14905.4 14966.1 11417.0 11430.3 11443.1 11455.9 11509.1 13764.9 14067.0 14273.9 14284.6 14360.3 5912.6 5959.3 5983.8 6020.5 6040.9 908.6 983.3 1029.8 1041.7 1126.9 28477.7 28744.9 28869.9 28871.0 28888.0 1080.6 1115.4 1167.3 1195.3 1213.8 14928.0 14996.6 15079.5 15122.3 15129.5 305194.0 308877.0 310211.0 310962.0 311480.0 51740.0 51769.0 51797.0 51854.0 52334.0 1327.6 1332.7 1344.8 1349.6 1356.3 27279.3 27777.9 28438.0 28575.9 28800.7 46411.3 46837.3 46841.0 46923.0 46932.3 299753.0 300032.0 301129.0 302850.0 303000.0 32140.5 32545.0 32820.5 32995.7 33048.3 43319.0 43320.8 43941.6 43993.8 44215.0 37111.8 37797.6 37829.4 37927.5 38510.8 36472.3 37099.8 37135.4 37903.4 37929.6 36231.3 36410.0 36562.6 36572.0 36670.6 32105.7 33657.5 33702.0 34226.3 34247.0 25450.5 25546.6 25768.6 25873.2 26128.6 05:51:49 INFO - 2015-11-17 05:51:49,625 DEBUG : BROWSER_OUTPUT: 05:51:49 INFO - 2015-11-17 05:51:49,625 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:28013.03 Median:453.64 stddev:88980.51 (19614.9%) stddev-sans-first:89205.87 05:51:49 INFO - 2015-11-17 05:51:49,625 DEBUG : BROWSER_OUTPUT: Values: 346.3 349.1 349.4 351.3 351.7 14526.7 14574.0 17095.9 17539.0 18510.8 17045.9 17379.8 17390.8 17765.4 17908.0 5244.2 5327.3 5343.4 5362.2 5368.0 5238.9 5361.5 5365.5 5372.9 5377.2 5287.2 5291.1 5295.5 5297.0 5297.0 5174.5 5226.3 5277.9 5285.8 5291.4 4645.3 4645.5 4650.0 4656.5 4657.3 20709.8 20932.8 20984.6 21013.4 21173.0 2184.3 2314.3 2332.9 2369.7 2437.1 13083.2 13360.0 13428.3 13523.9 13607.9 1846.3 1900.8 1909.6 1913.8 1917.5 58696.4 60542.7 62029.4 62150.7 62858.1 9476.1 9645.7 9887.7 9910.7 9927.1 8173.8 8258.5 8290.8 12538.0 12584.4 5656.8 5730.6 5800.7 5867.7 5892.7 6066.2 6067.5 6072.9 6077.4 6106.4 3265.1 3272.9 3284.3 3303.2 3323.2 1151.5 1160.5 1164.1 1166.5 1221.4 426.4 441.3 458.4 463.9 475.7 10723.5 10983.0 11184.7 11307.2 11788.3 428.5 440.0 449.8 457.4 458.1 5693.4 5875.6 6025.7 6052.7 6145.5 533550.0 541372.0 542507.1 548333.0 548645.0 79964.0 82697.0 82875.0 83289.6 83377.6 485.8 487.2 491.9 492.2 492.9 10375.0 10414.7 10489.4 10563.3 10666.6 33223.5 35230.5 35375.1 36339.1 39425.8 48395.8 49044.8 49356.8 49874.3 50090.0 8314.0 8364.7 8509.1 8516.8 8562.5 11991.8 12093.3 12266.6 12304.2 12402.5 10729.1 10732.4 11004.1 11026.6 11071.8 10427.6 10776.5 10874.0 11003.9 11099.3 9870.2 11015.2 11313.4 11320.4 11361.9 8339.0 8360.0 8481.4 8485.7 8517.2 10742.7 10915.8 10951.3 10998.2 11009.9 05:51:49 INFO - 2015-11-17 05:51:49,626 DEBUG : BROWSER_OUTPUT: 05:51:49 INFO - 2015-11-17 05:51:49,626 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:5319.35 Median:6259.84 stddev:2711.78 (43.3%) stddev-sans-first:2703.53 05:51:49 INFO - 2015-11-17 05:51:49,627 DEBUG : BROWSER_OUTPUT: Values: 1417.5 1474.8 1590.5 1628.6 1725.2 7086.7 7281.1 7316.3 7359.0 7437.7 7602.4 7706.3 7764.5 7768.6 7774.8 2252.3 2274.7 2282.1 2283.5 2284.1 2282.1 2322.1 2345.9 2350.4 2350.7 2268.1 2275.9 2275.9 2287.5 2317.9 2272.1 2283.3 2300.2 2300.9 2302.0 2316.5 2330.9 2337.5 2353.1 2355.7 7618.1 7640.4 7658.4 7658.7 7703.8 4612.9 4682.1 4682.6 4684.4 4689.6 3177.1 3180.9 3232.1 3242.4 3260.4 1057.5 1065.1 1074.3 1086.2 1108.6 10161.7 10176.8 10236.1 10297.4 10373.3 4085.0 4100.0 4118.5 4185.6 4194.0 8499.2 8522.9 8539.4 8559.0 8581.1 4529.0 4565.4 4572.3 4592.2 4594.8 4130.1 4185.3 4212.2 4236.9 4243.0 3473.5 3490.9 3510.7 3518.4 3531.6 1093.6 1114.7 1115.9 1117.6 1123.7 1299.9 1310.8 1325.4 1327.5 1343.4 6987.5 6994.4 7129.4 7160.7 7179.2 489.6 495.4 495.8 498.8 510.3 5528.8 5534.9 5555.2 5582.1 5585.5 8751.6 8792.5 8943.7 9012.6 9097.1 8912.7 8913.9 8928.6 8941.3 9017.9 7099.3 7118.0 7122.9 7129.9 7153.5 7004.9 7014.4 7056.9 7064.1 7070.3 7695.0 7919.2 7927.1 8003.0 8081.8 8009.2 8095.3 8125.3 8250.3 8281.0 6786.7 6797.2 6939.4 6948.1 6952.0 7460.3 7506.5 7514.4 7550.4 7557.1 6827.7 7107.3 7111.9 7156.2 7196.1 6852.6 6875.7 6917.0 6948.4 6986.6 6533.9 6732.1 6759.4 6921.8 6932.2 6356.6 6396.2 6402.5 6406.1 6427.3 6252.7 6267.0 6277.7 6350.3 6371.5 05:51:49 INFO - 2015-11-17 05:51:49,627 DEBUG : BROWSER_OUTPUT: 05:51:49 INFO - 2015-11-17 05:51:49,627 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:5568.00 Median:6318.65 stddev:1724.93 (27.3%) stddev-sans-first:1684.38 05:51:49 INFO - 2015-11-17 05:51:49,627 DEBUG : BROWSER_OUTPUT: Values: 330.4 333.2 337.6 339.8 341.4 6277.4 6292.9 6294.7 6367.5 6527.2 6279.4 6342.6 6352.8 6365.6 6378.4 4798.2 4798.9 4802.9 4806.5 4807.5 4806.0 4810.8 4817.5 4818.0 4821.3 4657.4 4724.7 4725.0 4741.4 4743.2 4724.4 4728.5 4730.5 4733.2 4741.5 4091.5 4094.2 4095.9 4096.5 4100.0 6010.9 6028.5 6029.8 6035.7 6054.5 5363.0 5478.0 5492.5 5493.7 5506.6 6674.1 6689.6 6703.7 6706.2 6744.5 4466.1 4471.2 4471.3 4472.4 4472.5 6789.7 6819.0 6900.3 6951.7 6972.7 4482.6 4488.3 4493.0 4504.7 4505.3 4537.1 4539.5 4547.1 4553.2 4568.6 5375.2 5412.1 5412.5 5413.6 5419.3 6495.9 6718.8 6745.8 6751.8 6781.4 1615.5 1662.2 1676.3 1678.5 1683.2 1040.4 1042.5 1048.1 1050.7 1063.3 6242.7 6251.1 6257.8 6261.5 6285.6 6702.7 6723.6 6764.6 6774.6 6776.3 6249.9 6271.1 6372.9 6377.4 6377.9 3740.9 3752.6 3770.1 3776.9 3778.9 7121.8 7171.2 7205.7 7210.3 7218.2 6944.9 7047.9 7097.6 7118.8 7119.7 7155.6 7168.2 7173.3 7177.5 7194.7 6857.9 6879.1 6884.9 6887.6 6915.1 6685.3 6709.0 6774.0 6795.7 6884.6 7241.0 7291.7 7317.8 7328.8 7334.5 4524.3 4550.5 4556.1 4558.8 4574.2 6847.7 6925.3 6950.6 6986.1 7025.3 6821.7 6831.9 6832.3 6832.9 6848.0 6816.2 6820.8 6834.0 6841.1 6841.2 6572.2 6686.3 6696.7 6699.9 6709.9 6823.7 6828.7 6843.2 6850.6 6852.6 6661.2 6662.1 6674.6 6674.9 6681.0 05:51:49 INFO - 2015-11-17 05:51:49,627 DEBUG : BROWSER_OUTPUT: 05:51:49 INFO - 2015-11-17 05:51:49,627 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:13547.90 Median:47555.91 stddev:16074.72 (33.8%) stddev-sans-first:16091.13 05:51:49 INFO - 2015-11-17 05:51:49,627 DEBUG : BROWSER_OUTPUT: Values: 760.4 814.4 857.8 871.9 884.1 14771.3 15286.5 15303.5 15330.5 15339.6 14137.2 14202.2 14236.4 14259.9 14271.3 808.5 811.1 817.8 817.9 818.6 801.5 803.0 804.5 805.6 807.2 845.4 849.7 849.7 853.1 855.4 833.3 835.1 836.5 842.4 843.8 619.0 621.3 624.2 625.1 625.8 13063.6 13089.5 13132.9 13166.7 13276.7 10528.6 10648.1 10705.4 11065.7 11105.1 9759.9 9995.8 10069.4 10211.7 10436.6 3294.5 3309.0 3336.3 3435.1 3447.0 45988.3 46194.3 46301.3 46317.3 46397.5 7549.8 7587.2 7652.7 7696.5 7807.5 12157.8 12176.4 12187.5 12200.9 12230.3 6802.8 6816.5 6876.9 6979.3 7068.5 4310.7 4348.3 4354.8 4429.7 4435.6 2720.7 2750.3 2753.2 2753.4 2758.6 433.3 433.6 442.8 443.1 452.9 631.4 657.1 676.9 691.1 703.6 8927.7 9292.4 9472.4 9569.5 9595.8 594.8 615.7 694.6 701.9 707.8 4045.5 4079.9 4087.6 4100.8 4182.2 59913.7 60412.4 60623.7 60634.4 60655.7 47184.5 47903.3 47993.8 48489.3 48830.3 46451.3 47029.0 47343.8 47467.3 48120.5 8815.3 9094.9 9111.1 9121.9 9200.2 34861.7 35039.3 35060.0 35632.5 35884.0 41507.8 47136.3 47423.3 47644.5 48408.8 8191.5 8265.2 8342.7 8413.0 8741.4 12165.5 12377.4 12410.5 12446.8 13021.3 10840.8 10906.8 11093.6 11447.3 11549.3 11875.5 11917.3 12191.6 12608.2 12621.1 10291.5 11095.0 11128.9 11214.7 11432.9 9564.1 9654.5 9686.6 9713.9 9816.8 8545.9 8793.8 9000.3 9565.6 9797.8 05:51:49 INFO - 2015-11-17 05:51:49,627 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:51:49 INFO - 2015-11-17 05:51:49,627 DEBUG : BROWSER_OUTPUT: 05:51:50 INFO - 2015-11-17 05:51:50,297 INFO : Browser exited with error code: 0 05:51:50 INFO - 2015-11-17 05:51:50,319 INFO : Completed test dromaeo_css (00:18:30) 05:51:50 INFO - 2015-11-17 05:51:50,319 INFO : Starting test kraken 05:51:50 INFO - 2015-11-17 05:51:50,319 DEBUG : operating with platform_type : linux_ 05:51:50 INFO - 2015-11-17 05:51:50,319 INFO : Initialising browser for kraken test... 05:51:50 INFO - 2015-11-17 05:51:50,325 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpxfff9I/profile http://localhost:45009/getInfo.html 05:51:54 INFO - 2015-11-17 05:51:54,735 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:51:54 INFO - 2015-11-17 05:51:54,735 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:51:54 INFO - 2015-11-17 05:51:54,735 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/668 05:51:54 INFO - 2015-11-17 05:51:54,735 DEBUG : BROWSER_OUTPUT: __metrics 05:51:55 INFO - 2015-11-17 05:51:55,813 INFO : Browser initialized. 05:51:55 INFO - 2015-11-17 05:51:55,813 INFO : Running cycle 1/1 for kraken test... 05:51:55 INFO - 2015-11-17 05:51:55,814 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpxfff9I/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:52:07 INFO - 2015-11-17 05:52:07,625 DEBUG : BROWSER_OUTPUT: RSS: Main: 140976128 05:52:07 INFO - 2015-11-17 05:52:07,626 DEBUG : BROWSER_OUTPUT: 05:52:10 INFO - 2015-11-17 05:52:10,122 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:45009/tests/kraken/driver.html?testName=audio-beat-detection) 05:52:10 INFO - 2015-11-17 05:52:10,723 DEBUG : BROWSER_OUTPUT: RSS: Main: 142057472 05:52:10 INFO - 2015-11-17 05:52:10,723 DEBUG : BROWSER_OUTPUT: 05:52:13 INFO - 2015-11-17 05:52:13,360 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:45009/tests/kraken/driver.html?testName=audio-dft) 05:52:13 INFO - 2015-11-17 05:52:13,966 DEBUG : BROWSER_OUTPUT: RSS: Main: 141737984 05:52:13 INFO - 2015-11-17 05:52:13,967 DEBUG : BROWSER_OUTPUT: 05:52:16 INFO - 2015-11-17 05:52:16,806 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:45009/tests/kraken/driver.html?testName=audio-fft) 05:52:17 INFO - 2015-11-17 05:52:17,379 DEBUG : BROWSER_OUTPUT: RSS: Main: 136650752 05:52:17 INFO - 2015-11-17 05:52:17,379 DEBUG : BROWSER_OUTPUT: 05:52:19 INFO - 2015-11-17 05:52:19,375 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:45009/tests/kraken/driver.html?testName=audio-oscillator) 05:52:19 INFO - 2015-11-17 05:52:19,997 DEBUG : BROWSER_OUTPUT: RSS: Main: 135745536 05:52:19 INFO - 2015-11-17 05:52:19,997 DEBUG : BROWSER_OUTPUT: 05:52:22 INFO - 2015-11-17 05:52:22,231 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:45009/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:52:22 INFO - 2015-11-17 05:52:22,805 DEBUG : BROWSER_OUTPUT: RSS: Main: 137150464 05:52:22 INFO - 2015-11-17 05:52:22,805 DEBUG : BROWSER_OUTPUT: 05:52:25 INFO - 2015-11-17 05:52:25,829 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:45009/tests/kraken/driver.html?testName=imaging-darkroom) 05:52:26 INFO - 2015-11-17 05:52:26,415 DEBUG : BROWSER_OUTPUT: RSS: Main: 138219520 05:52:26 INFO - 2015-11-17 05:52:26,415 DEBUG : BROWSER_OUTPUT: 05:52:29 INFO - 2015-11-17 05:52:29,831 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:45009/tests/kraken/driver.html?testName=imaging-desaturate) 05:52:30 INFO - 2015-11-17 05:52:30,431 DEBUG : BROWSER_OUTPUT: RSS: Main: 139493376 05:52:30 INFO - 2015-11-17 05:52:30,432 DEBUG : BROWSER_OUTPUT: 05:52:33 INFO - 2015-11-17 05:52:33,342 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:45009/tests/kraken/driver.html?testName=json-parse-financial) 05:52:33 INFO - 2015-11-17 05:52:33,928 DEBUG : BROWSER_OUTPUT: RSS: Main: 139026432 05:52:33 INFO - 2015-11-17 05:52:33,928 DEBUG : BROWSER_OUTPUT: 05:52:35 INFO - 2015-11-17 05:52:35,508 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:45009/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:52:36 INFO - 2015-11-17 05:52:36,082 DEBUG : BROWSER_OUTPUT: RSS: Main: 139169792 05:52:36 INFO - 2015-11-17 05:52:36,083 DEBUG : BROWSER_OUTPUT: 05:52:37 INFO - 2015-11-17 05:52:37,938 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:45009/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:52:38 INFO - 2015-11-17 05:52:38,544 DEBUG : BROWSER_OUTPUT: RSS: Main: 138579968 05:52:38 INFO - 2015-11-17 05:52:38,544 DEBUG : BROWSER_OUTPUT: 05:52:40 INFO - 2015-11-17 05:52:40,677 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:45009/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:52:41 INFO - 2015-11-17 05:52:41,259 DEBUG : BROWSER_OUTPUT: RSS: Main: 140308480 05:52:41 INFO - 2015-11-17 05:52:41,259 DEBUG : BROWSER_OUTPUT: 05:52:43 INFO - 2015-11-17 05:52:43,746 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:45009/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:52:44 INFO - 2015-11-17 05:52:44,348 DEBUG : BROWSER_OUTPUT: RSS: Main: 138911744 05:52:44 INFO - 2015-11-17 05:52:44,348 DEBUG : BROWSER_OUTPUT: 05:52:46 INFO - 2015-11-17 05:52:46,945 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:45009/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:52:47 INFO - 2015-11-17 05:52:47,526 DEBUG : BROWSER_OUTPUT: RSS: Main: 139087872 05:52:47 INFO - 2015-11-17 05:52:47,527 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,215 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:45009/tests/kraken/driver.html?testName=ai-astar) 05:52:49 INFO - 2015-11-17 05:52:49,466 DEBUG : BROWSER_OUTPUT: RSS: Main: 140398592 05:52:49 INFO - 2015-11-17 05:52:49,466 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,467 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:52:49 INFO - 2015-11-17 05:52:49,468 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:52:49 INFO - 2015-11-17 05:52:49,468 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:52:49 INFO - 2015-11-17 05:52:49,468 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:52:49 INFO - 2015-11-17 05:52:49,468 DEBUG : BROWSER_OUTPUT: |0;ai-astar;113;107;110;110;111;124;111;112;109;110 05:52:49 INFO - 2015-11-17 05:52:49,468 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;148;126;148;165;128;152;162;128;166;128 05:52:49 INFO - 2015-11-17 05:52:49,469 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;162;162;164;164;160;162;167;169;163 05:52:49 INFO - 2015-11-17 05:52:49,469 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;74;76;73;73;73;148;72;72;72 05:52:49 INFO - 2015-11-17 05:52:49,469 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;91;91;136;93;93;91;145;91;91;134 05:52:49 INFO - 2015-11-17 05:52:49,469 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;110;111;110;109;110;111;111;110;110 05:52:49 INFO - 2015-11-17 05:52:49,470 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;147;146;146;148;147;147;147;148;149;148 05:52:49 INFO - 2015-11-17 05:52:49,470 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;98;97;97;97;97;96;96;96;96;96 05:52:49 INFO - 2015-11-17 05:52:49,470 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;59;59;59;62;60;61;60;60;59;59 05:52:49 INFO - 2015-11-17 05:52:49,470 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;69;69;69;69;70;70;69;72;71;70 05:52:49 INFO - 2015-11-17 05:52:49,470 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;95;88;86;95;86;86;87;87;88;86 05:52:49 INFO - 2015-11-17 05:52:49,471 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;132;126;122;125;121;116;121;126;124;126 05:52:49 INFO - 2015-11-17 05:52:49,471 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;145;171;158;153;151;140;152;151;142;138 05:52:49 INFO - 2015-11-17 05:52:49,471 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;68;67;66;67;67;69;68;69;65;70 05:52:49 INFO - 2015-11-17 05:52:49,471 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:52:49 INFO - 2015-11-17 05:52:49,472 DEBUG : BROWSER_OUTPUT: __start_cc_report 05:52:49 INFO - 2015-11-17 05:52:49,472 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,710 05:52:49 INFO - 2015-11-17 05:52:49,472 DEBUG : BROWSER_OUTPUT: __end_cc_report 05:52:49 INFO - 2015-11-17 05:52:49,472 DEBUG : BROWSER_OUTPUT: __startTimestamp1447768369466__endTimestamp 05:52:49 INFO - 2015-11-17 05:52:49,473 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,476 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:52:49 INFO - 2015-11-17 05:52:49,476 DEBUG : BROWSER_OUTPUT: Number of tests: 14 05:52:49 INFO - 2015-11-17 05:52:49,476 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,476 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:111.70 Median:111.00 stddev:4.62 (4.2%) stddev-sans-first:4.88 05:52:49 INFO - 2015-11-17 05:52:49,476 DEBUG : BROWSER_OUTPUT: Values: 113.0 107.0 110.0 110.0 111.0 124.0 111.0 112.0 109.0 110.0 05:52:49 INFO - 2015-11-17 05:52:49,476 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,476 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:145.10 Median:150.00 stddev:16.41 (10.9%) stddev-sans-first:17.38 05:52:49 INFO - 2015-11-17 05:52:49,476 DEBUG : BROWSER_OUTPUT: Values: 148.0 126.0 148.0 165.0 128.0 152.0 162.0 128.0 166.0 128.0 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:163.40 Median:163.50 stddev:2.76 (1.7%) stddev-sans-first:2.78 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: Values: 161.0 162.0 162.0 164.0 164.0 160.0 162.0 167.0 169.0 163.0 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:80.50 Median:73.00 stddev:23.75 (32.5%) stddev-sans-first:24.99 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: Values: 72.0 74.0 76.0 73.0 73.0 73.0 148.0 72.0 72.0 72.0 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.60 Median:91.00 stddev:22.77 (25.0%) stddev-sans-first:23.53 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: Values: 91.0 91.0 136.0 93.0 93.0 91.0 145.0 91.0 91.0 134.0 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:110.20 Median:110.00 stddev:0.63 (0.6%) stddev-sans-first:0.67 05:52:49 INFO - 2015-11-17 05:52:49,477 DEBUG : BROWSER_OUTPUT: Values: 110.0 110.0 111.0 110.0 109.0 110.0 111.0 111.0 110.0 110.0 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:147.30 Median:147.50 stddev:0.95 (0.6%) stddev-sans-first:1.00 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: Values: 147.0 146.0 146.0 148.0 147.0 147.0 147.0 148.0 149.0 148.0 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:96.60 Median:97.00 stddev:0.70 (0.7%) stddev-sans-first:0.53 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: Values: 98.0 97.0 97.0 97.0 97.0 96.0 96.0 96.0 96.0 96.0 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:59.80 Median:60.00 stddev:1.03 (1.7%) stddev-sans-first:1.05 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: Values: 59.0 59.0 59.0 62.0 60.0 61.0 60.0 60.0 59.0 59.0 05:52:49 INFO - 2015-11-17 05:52:49,478 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:69.80 Median:70.00 stddev:1.03 (1.5%) stddev-sans-first:1.05 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: Values: 69.0 69.0 69.0 69.0 70.0 70.0 69.0 72.0 71.0 70.0 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:88.40 Median:87.50 stddev:3.57 (4.1%) stddev-sans-first:2.87 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: Values: 95.0 88.0 86.0 95.0 86.0 86.0 87.0 87.0 88.0 86.0 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:123.90 Median:125.50 stddev:4.25 (3.4%) stddev-sans-first:3.35 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: Values: 132.0 126.0 122.0 125.0 121.0 116.0 121.0 126.0 124.0 126.0 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:150.10 Median:151.50 stddev:9.73 (6.4%) stddev-sans-first:10.15 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: Values: 145.0 171.0 158.0 153.0 151.0 140.0 152.0 151.0 142.0 138.0 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.60 Median:68.00 stddev:1.51 (2.2%) stddev-sans-first:1.59 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: Values: 68.0 67.0 66.0 67.0 67.0 69.0 68.0 69.0 65.0 70.0 05:52:49 INFO - 2015-11-17 05:52:49,479 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:52:49 INFO - 2015-11-17 05:52:49,480 DEBUG : BROWSER_OUTPUT: 05:52:50 INFO - 2015-11-17 05:52:50,309 INFO : Browser exited with error code: 0 05:52:50 INFO - 2015-11-17 05:52:50,362 INFO : Completed test kraken (00:01:00) 05:52:50 INFO - 2015-11-17 05:52:50,363 INFO : Starting test v8_7 05:52:50 INFO - 2015-11-17 05:52:50,363 DEBUG : operating with platform_type : linux_ 05:52:50 INFO - 2015-11-17 05:52:50,363 INFO : Initialising browser for v8_7 test... 05:52:50 INFO - 2015-11-17 05:52:50,369 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpQ5XfTY/profile http://localhost:45009/getInfo.html 05:52:54 INFO - 2015-11-17 05:52:54,811 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 05:52:54 INFO - 2015-11-17 05:52:54,811 DEBUG : BROWSER_OUTPUT: colorDepth:24 05:52:54 INFO - 2015-11-17 05:52:54,811 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/668 05:52:54 INFO - 2015-11-17 05:52:54,811 DEBUG : BROWSER_OUTPUT: __metrics 05:52:55 INFO - 2015-11-17 05:52:55,781 INFO : Browser initialized. 05:52:55 INFO - 2015-11-17 05:52:55,781 INFO : Running cycle 1/1 for v8_7 test... 05:52:55 INFO - 2015-11-17 05:52:55,782 DEBUG : command line: /builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpQ5XfTY/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 05:53:07 INFO - 2015-11-17 05:53:07,614 DEBUG : BROWSER_OUTPUT: RSS: Main: 141148160 05:53:07 INFO - 2015-11-17 05:53:07,614 DEBUG : BROWSER_OUTPUT: 05:53:28 INFO - 2015-11-17 05:53:28,972 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:45009/tests/v8_7/run.html (next: http://localhost:45009/tests/v8_7/run.html) 05:53:29 INFO - 2015-11-17 05:53:29,222 DEBUG : BROWSER_OUTPUT: RSS: Main: 138702848 05:53:29 INFO - 2015-11-17 05:53:29,222 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,222 DEBUG : BROWSER_OUTPUT: __start_tp_report 05:53:29 INFO - 2015-11-17 05:53:29,222 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 05:53:29 INFO - 2015-11-17 05:53:29,223 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 05:53:29 INFO - 2015-11-17 05:53:29,223 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 05:53:29 INFO - 2015-11-17 05:53:29,223 DEBUG : BROWSER_OUTPUT: |0;Richards;162.57519102584945 05:53:29 INFO - 2015-11-17 05:53:29,223 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;193.38619222587508 05:53:29 INFO - 2015-11-17 05:53:29,223 DEBUG : BROWSER_OUTPUT: |2;Encrypt;281.0567734682406 05:53:29 INFO - 2015-11-17 05:53:29,224 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5060.606060606061 05:53:29 INFO - 2015-11-17 05:53:29,224 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1071.8113612004288 05:53:29 INFO - 2015-11-17 05:53:29,224 DEBUG : BROWSER_OUTPUT: |5;Earley;718.3908045977012 05:53:29 INFO - 2015-11-17 05:53:29,224 DEBUG : BROWSER_OUTPUT: |6;Boyer;11964.285714285714 05:53:29 INFO - 2015-11-17 05:53:29,224 DEBUG : BROWSER_OUTPUT: |7;RegExp;25400 05:53:29 INFO - 2015-11-17 05:53:29,224 DEBUG : BROWSER_OUTPUT: |8;Splay;626.5664160401003 05:53:29 INFO - 2015-11-17 05:53:29,224 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4859.223300970873 05:53:29 INFO - 2015-11-17 05:53:29,225 DEBUG : BROWSER_OUTPUT: __end_tp_report 05:53:29 INFO - 2015-11-17 05:53:29,225 DEBUG : BROWSER_OUTPUT: __startTimestamp1447768409221__endTimestamp 05:53:29 INFO - 2015-11-17 05:53:29,225 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,226 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 05:53:29 INFO - 2015-11-17 05:53:29,226 DEBUG : BROWSER_OUTPUT: Number of tests: 10 05:53:29 INFO - 2015-11-17 05:53:29,226 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,227 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:162.58 Median:162.58 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,227 DEBUG : BROWSER_OUTPUT: Values: 162.6 05:53:29 INFO - 2015-11-17 05:53:29,227 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,227 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:193.39 Median:193.39 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,227 DEBUG : BROWSER_OUTPUT: Values: 193.4 05:53:29 INFO - 2015-11-17 05:53:29,227 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,227 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:281.06 Median:281.06 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,228 DEBUG : BROWSER_OUTPUT: Values: 281.1 05:53:29 INFO - 2015-11-17 05:53:29,228 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,228 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5060.61 Median:5060.61 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,228 DEBUG : BROWSER_OUTPUT: Values: 5060.6 05:53:29 INFO - 2015-11-17 05:53:29,228 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,228 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1071.81 Median:1071.81 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,228 DEBUG : BROWSER_OUTPUT: Values: 1071.8 05:53:29 INFO - 2015-11-17 05:53:29,228 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:718.39 Median:718.39 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: Values: 718.4 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:11964.29 Median:11964.29 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: Values: 11964.3 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:25400.00 Median:25400.00 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: Values: 25400.0 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:626.57 Median:626.57 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: Values: 626.6 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4859.22 Median:4859.22 stddev:0.00 (0.0%) 05:53:29 INFO - 2015-11-17 05:53:29,229 DEBUG : BROWSER_OUTPUT: Values: 4859.2 05:53:29 INFO - 2015-11-17 05:53:29,230 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 05:53:29 INFO - 2015-11-17 05:53:29,230 DEBUG : BROWSER_OUTPUT: 05:53:30 INFO - 2015-11-17 05:53:30,145 INFO : Browser exited with error code: 0 05:53:30 INFO - 2015-11-17 05:53:30,157 INFO : Completed test v8_7 (00:00:39) 05:53:30 INFO - 2015-11-17 05:53:30,259 INFO : Completed test suite (00:20:09) 05:53:30 INFO - 2015-11-17 05:53:30,259 DEBUG : Working with test: dromaeo_css 05:53:30 INFO - 2015-11-17 05:53:30,259 DEBUG : Generating results file: dromaeo_css 05:53:30 INFO - 2015-11-17 05:53:30,260 DEBUG : Working with test: kraken 05:53:30 INFO - 2015-11-17 05:53:30,260 DEBUG : Generating results file: kraken 05:53:30 INFO - 2015-11-17 05:53:30,260 INFO : javascript benchmark 05:53:30 INFO - 2015-11-17 05:53:30,261 DEBUG : Working with test: v8_7 05:53:30 INFO - 2015-11-17 05:53:30,261 DEBUG : Generating results file: v8_7 05:53:30 INFO - 2015-11-17 05:53:30,261 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:53:30 INFO - 2015-11-17 05:53:30,326 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,1,43]] 05:53:30 INFO - 2015-11-17 05:53:30,326 DEBUG : process_Request line: dromaeo_css 6783.40 graph.html#tests=[[72,1,43]] 05:53:30 INFO - 2015-11-17 05:53:30,326 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:53:30 INFO - 2015-11-17 05:53:30,357 DEBUG : process_Request line: kraken 1520.00 graph.html#tests=[[232,1,43]] 05:53:30 INFO - 2015-11-17 05:53:30,358 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 05:53:30 INFO - 2015-11-17 05:53:30,394 DEBUG : process_Request line: v8_7 21336.36 graph.html#tests=[[230,1,43]] 05:53:30 INFO - 2015-11-17 05:53:30,395 INFO : javascript benchmark 05:53:30 INFO - 2015-11-17 05:53:30,399 INFO : TALOSDATA: [{"talos_counters": {}, "results": {"jquery.html": [346.2583206471449, 349.1289233362757, 349.43042840170534, 351.25533868199415, 351.7291685402239, 14526.709465810678, 14574.0, 17095.914520427395, 17539.0, 18510.814891851096, 17045.931732288183, 17379.82620173798, 17390.82609173908, 17765.378211762592, 17908.0, 5244.239585260135, 5327.307450031491, 5343.385510666284, 5362.249285100089, 5367.973160134214, 5238.8690282742855, 5361.544268737162, 5365.517103460687, 5372.892542149155, 5377.193420986864, 5287.206918962148, 5291.100512912814, 5295.4969277918535, 5296.967091417175, 5296.993571221475, 5174.456682048369, 5226.2944502492055, 5277.868053298679, 5285.841424757245, 5291.417944026154, 4645.256758918556, 4645.488996210414, 4649.976750116261, 4656.4877863434995, 4657.324687920266, 20709.792902070938, 20932.790672093237, 20984.5803083939, 21013.369598912057, 21173.0, 2184.322859913416, 2314.305708287524, 2332.8833558322185, 2369.7393286738443, 2437.1348171399077, 13083.215007099605, 13360.0, 13428.261445620486, 13523.932380338134, 13607.863921360859, 1846.2891786662096, 1900.8099190080882, 1909.598984213317, 1913.7512123423867, 1917.4726950088698, 58696.41303586952, 60542.69728651373, 62029.37970620281, 62150.68924655393, 62858.0571291431, 9476.147146756686, 9645.71062868115, 9887.653932112342, 9910.653127140515, 9927.106560409598, 8173.79565510867, 8258.463199891989, 8290.751277461686, 12538.0, 12584.4337004835, 5656.830295091154, 5730.627509211888, 5800.709964501758, 5867.70661466925, 5892.6759028253855, 6066.150738896558, 6067.514598832083, 6072.939270607326, 6077.392260773976, 6106.419890110433, 3265.1184180271193, 3272.9345413091605, 3284.3431313737346, 3303.240254741423, 3323.202431416491, 1151.5336288803048, 1160.4661855546542, 1164.1036401970434, 1166.4984056855633, 1221.4198255828587, 426.3860041540172, 441.3071477779855, 458.410941939606, 463.89098561837943, 475.6860472088405, 10723.46382680863, 10982.95661912117, 11184.664460066211, 11307.208495405243, 11788.29270243788, 428.4580006292043, 439.9538048504925, 449.8290649553149, 457.4464897474094, 458.0906899803887, 5693.373728889819, 5875.6180848245585, 6025.698715064317, 6052.697365131814, 6145.477634401037, 533550.0, 541372.0, 542507.1498570007, 548333.0, 548645.0, 79964.0, 82697.0, 82875.0, 83289.58355208306, 83377.58311208404, 485.75712143928035, 487.16451286044605, 491.89670169264855, 492.19280380176536, 492.8619986403813, 10375.0, 10414.687559373231, 10489.423081730578, 10563.313384629975, 10666.626668066581, 33223.501647475794, 35230.47154292637, 35375.11562210965, 36339.091522712144, 39425.80287098661, 48395.758021209665, 49044.75477622589, 49356.75321623369, 49874.25188622246, 50090.0, 8313.958430207811, 8364.665413383396, 8509.149085091442, 8516.829663406821, 8562.48625082497, 11991.76016479683, 12093.274403535816, 12266.570670026505, 12304.200226985575, 12402.503899843905, 10729.141668666332, 10732.409717465302, 11004.119670426187, 11026.614068507564, 11071.778564428505, 10427.582896684047, 10776.515056822305, 10874.0, 11003.944980275048, 11099.278546894426, 9870.161036311994, 11015.173861960226, 11313.377764222718, 11320.377379243891, 11361.943190283995, 8339.0, 8360.038595561346, 8481.40630155883, 8485.660573576988, 8517.190866867637, 10742.73143171427, 10915.78168436611, 10951.288166269167, 10998.175136864607, 11009.889901100887], "dojo.html": [3241.9513707294395, 3316.883909063183, 3321.2195134143485, 3355.4295769719147, 3358.412277851377, 5341.0, 5439.102548079572, 5475.178723191523, 5524.944750552493, 5526.226328314035, 5335.919961200585, 5370.865728356793, 5429.375621803484, 5447.809326673567, 5506.119020956648, 5011.42368627607, 5015.32293140425, 5061.974690126544, 5081.720505372203, 5085.618578606619, 5038.2190760432195, 5051.494850514938, 5082.364704411949, 5092.8472145835685, 5098.337216161894, 4897.02059588082, 4951.059298733229, 5004.924926126129, 5014.548690617826, 5014.749262536895, 5065.746712664389, 5075.289459475676, 5083.618728595333, 5129.25625784263, 5147.948520514822, 4966.180580204262, 5072.594192464594, 5083.61872859537, 5094.923576146361, 5098.694078355274, 5327.413984461706, 5340.786368545254, 5345.812896548602, 5346.97326513365, 5431.321084864392, 5917.674527900964, 5966.8209953701025, 5969.970150149265, 5974.761009559613, 5992.8501787455225, 5830.708464576796, 5881.206037184968, 5923.733431995527, 5970.402959704038, 6002.609830361012, 5586.329640443132, 5599.580031497654, 5604.579656525736, 5605.971970140164, 5683.090705487143, 6050.515958723292, 6056.152138700585, 6061.333253342129, 6064.06007068905, 6067.484263837535, 5606.159076138611, 5762.078067509178, 5765.0, 5792.420757924174, 5885.646861188342, 5838.883222335529, 5845.7369418376275, 5877.529797616266, 5931.6441013539325, 5960.493358064527, 5873.2658417697785, 5874.794382196603, 5880.0, 5898.793542226002, 6054.636721796706, 5765.913511297334, 5818.738156782955, 5835.037218858841, 5864.9413505864395, 5888.676122813286, 4555.06621142665, 4615.8846028848875, 4621.630269578425, 4641.8375356863025, 4667.789949452283, 4023.136756885474, 4033.717639765247, 4069.877903662895, 4088.2845502037026, 4092.7748973806724, 5541.501264886179, 5592.0, 5623.578231632644, 5680.6591604503865, 5719.857003574861, 6033.155358249848, 6051.788187413419, 6066.575339726265, 6073.119397687311, 6082.635041897412, 5738.053221218453, 5739.339975902742, 5739.827805165852, 5757.481826635623, 5759.280089988752, 5063.873403164876, 5109.463506331856, 5150.922736158961, 5243.872567398028, 5257.526822585985, 6170.50635949123, 6234.594751341148, 6258.874822503524, 6264.310925798159, 6270.561060725706, 5990.820275391745, 6032.4570788629235, 6033.487153591818, 6037.577369584087, 6040.305364883095, 5869.383714710065, 6021.939780602138, 6055.515558755377, 6140.631562106288, 6155.84610384744, 5861.501772349398, 5907.556933229939, 5922.2597175353085, 5922.703864806656, 5924.526037917042, 5741.540676745767, 5973.880522389615, 5993.790217342372, 5994.910076348945, 6004.579679422399, 5712.971435142964, 5735.9139612905, 5799.652020878761, 5817.127430885401, 5838.416158384128, 5657.943420565742, 5704.572157088152, 5709.172170035238, 5711.257536520226, 5734.827955161351, 5568.77724891016, 5616.803411880564, 5659.094544872801, 5673.177389278449, 5790.507806836466, 5774.04728219839, 5788.942110578841, 5822.243108395882, 5837.387074357302, 5878.853028674317, 5648.350439699487, 5709.286339207599, 5711.428857114422, 5726.685032323262, 5741.13882917549], "mootools.html": [1417.4755340524005, 1474.8303945046323, 1590.5228431470555, 1628.5928517870532, 1725.1719174796096, 7086.716531338747, 7281.089863767029, 7316.341529262365, 7358.96320518398, 7437.739679111232, 7602.3918086553085, 7706.306432421081, 7764.495307804988, 7768.6115694215205, 7774.8445031099345, 2252.324302709185, 2274.73840508342, 2282.0985710644286, 2283.5204607032542, 2284.120613563773, 2282.1327895399727, 2322.140807901079, 2345.929622111331, 2350.4476448034698, 2350.71791385034, 2268.115434980359, 2275.8975846086882, 2275.920342788003, 2287.451011757183, 2317.9304620861403, 2272.1479445208047, 2283.315005498352, 2300.1834348806183, 2300.8504447210876, 2302.033146078651, 2316.513532158249, 2330.883455827202, 2337.520808234308, 2353.1411034972284, 2355.740868504463, 7618.123915749649, 7640.388768898475, 7658.425618078666, 7658.693652253904, 7703.768886933401, 4612.884677883047, 4682.063587282557, 4682.555157260055, 4684.3910291662205, 4689.62483001359, 3177.094528059492, 3180.904572862818, 3232.127325622069, 3242.416365054289, 3260.396826587089, 1057.5188289328337, 1065.1053115383038, 1074.2856000759487, 1086.1582273737915, 1108.6009036746764, 10161.695149145537, 10176.79646407075, 10236.129928955974, 10297.433641149808, 10373.325733827278, 4084.9795751021647, 4099.97950010248, 4118.546959834416, 4185.560516145822, 4193.958060419418, 8499.150084991576, 8522.914770852336, 8539.359548033923, 8558.957205213934, 8581.056083830774, 4529.0, 4565.360849481075, 4572.337011133433, 4592.196365636067, 4594.770261486912, 4130.091379896418, 4185.288500954845, 4212.178625168062, 4236.91526169481, 4242.981684395722, 3473.4616134499192, 3490.89527314181, 3510.684038436553, 3518.3666939950544, 3531.646835316448, 1093.5953697132113, 1114.7046032801313, 1115.9163062770324, 1117.5529788084832, 1123.6516679829278, 1299.91550549214, 1310.8492523359935, 1325.350578216667, 1327.5353626230742, 1343.395472037587, 6987.475939304471, 6994.405475534637, 7129.429645628441, 7160.749373771893, 7179.174394944648, 489.5789620926001, 495.3857217050831, 495.80911349130844, 498.8303976647957, 510.3187245027855, 5528.834134975958, 5534.889302213933, 5555.194496798023, 5582.051051321285, 5585.525230355384, 8751.606177722018, 8792.516411597295, 8943.731688049369, 9012.594433250519, 9097.13577210164, 8912.688055918012, 8913.866292005625, 8928.553572321358, 8941.329400295004, 9017.864732029026, 7099.2545782693105, 7118.0, 7122.92877071233, 7129.857402851914, 7153.535020223669, 7004.894926576208, 7014.368706816411, 7056.929430705833, 7064.116985376828, 7070.257622949722, 7695.0, 7919.208079192034, 7927.128015918129, 8002.9599852000365, 8081.83836323282, 8009.199080091944, 8095.311898488459, 8125.268725814705, 8250.339972802041, 8280.958595206985, 6786.69459874297, 6797.1843378794865, 6939.375456208965, 6948.062011628365, 6951.965240173767, 7460.29127232912, 7506.474546781673, 7514.436417268617, 7550.395968322411, 7557.093148821957, 6827.658617069226, 7107.289271072851, 7111.857762844611, 7156.248593897774, 7196.10048743907, 6852.554583952027, 6875.724971001104, 6916.965415172892, 6948.409385202112, 6986.580805151707, 6533.934660653523, 6732.057511948233, 6759.425448836904, 6921.826954326182, 6932.202796678446, 6356.555041147075, 6396.200474940632, 6402.487800976004, 6406.135171751754, 6427.3251308611925, 6252.687365631609, 6267.0, 6277.686115694106, 6350.269718982377, 6371.458426033839], "ext.html": [575.8848230353929, 581.1428143488354, 597.345906232675, 607.820692895596, 644.5584774429514, 38989.41515877261, 39849.80075099624, 39927.40108898365, 40058.59941400593, 40235.79882100593, 41087.0, 41805.37291940623, 41857.16285674285, 41870.0, 41891.58108418922, 8554.95722521388, 8748.518831464267, 8753.3872628916, 8777.605007774633, 8787.297016238686, 8275.710350137746, 8459.703910363138, 8542.0, 8564.443311184754, 8564.443311184785, 8394.202550757669, 8508.191721786452, 8512.1487851215, 8549.230569248766, 8577.785555361104, 8522.892024036897, 8558.058613552505, 8593.484390936565, 8600.8709869352, 8620.82758344836, 8320.958395207985, 8393.748187554322, 8423.0, 8432.198941100647, 8473.110323416015, 37942.43086353679, 38399.616003840165, 38428.42357364642, 38471.61528384708, 38536.03659908497, 3357.0, 3403.5235067090625, 3468.8959331219853, 3886.3198940185353, 4201.0, 29458.558121628193, 29727.0, 30026.549601755993, 30804.537931931038, 31167.844160779277, 3664.0, 3666.1018050577513, 3680.4847321375028, 3712.3874560697454, 3802.790846503441, 265910.0, 265989.0, 266809.0, 266864.0, 267487.0, 42072.57927420748, 42080.158396831896, 56360.71819640957, 57136.0, 57214.7139264301, 40665.763383014215, 40782.79608601938, 41140.794296028325, 41213.0, 41219.58780412217, 14663.633409164857, 14749.188794616184, 14894.70210595782, 14905.403783848742, 14966.102033878002, 11416.972472477517, 11430.314181149157, 11443.141764367705, 11455.942720286344, 11509.079273658088, 13764.862351376358, 14067.0, 14273.85726142746, 14284.642883927778, 14360.281985900663, 5912.556558258148, 5959.28488581373, 5983.820485385445, 6020.458158765732, 6040.86200952349, 908.5502676175204, 983.3362480325894, 1029.8455231715302, 1041.7135287795916, 1126.8929451702074, 28477.715222847506, 28744.856275718488, 28869.855650721613, 28871.0, 28888.0, 1080.5893760371166, 1115.4199816095747, 1167.3171194850938, 1195.3126952002633, 1213.7997230456876, 14928.0, 14996.550103496913, 15079.472218472301, 15122.319495622723, 15129.47046853377, 305194.0, 308877.0, 310211.0, 310962.0, 311480.0, 51740.0, 51769.0, 51797.0, 51854.0, 52334.0, 1327.6415367850818, 1332.6535100873648, 1344.8184495093233, 1349.595121463557, 1356.274393199653, 27279.318017049733, 27777.861110694317, 28438.0, 28575.857120715096, 28800.711992879802, 46411.303830441895, 46837.2974405391, 46841.0, 46923.0, 46932.29601555911, 299753.0, 300032.0, 301129.0, 302850.0, 303000.0, 32140.517892231168, 32545.0, 32820.507692384155, 32995.67004329926, 33048.33903321968, 43319.00300688378, 43320.78339608408, 43941.560584393745, 43993.78003109964, 44215.0, 37111.81444092762, 37797.62202377941, 37829.43255851109, 37927.45182269588, 38510.80744596259, 36472.27055458929, 37099.81450092732, 37135.44296835495, 37903.43144852885, 37929.62070379371, 36231.27537449289, 36410.0, 36562.63437365592, 36572.0, 36670.633293666724, 32105.67894321027, 33657.495137573445, 33702.0, 34226.315473690884, 34247.0, 25450.490990180464, 25546.616800747634, 25768.61347079758, 25873.22380328593, 26128.60807087933], "prototype.html": [330.4151651576709, 333.1903474556829, 337.6286085306162, 339.8080084752116, 341.43492519879595, 6277.403646653572, 6292.8741425171465, 6294.748210071597, 6367.522435817309, 6527.151470308865, 6279.434850863421, 6342.556021078526, 6352.777652782153, 6365.554411191219, 6378.425941665249, 4798.232282834756, 4798.928016079762, 4802.927956080644, 4806.471288158317, 4807.471178170398, 4805.951940480585, 4810.807567697288, 4817.51824817519, 4818.0, 4821.252705830602, 4657.371254880599, 4724.7401392923375, 4725.0, 4741.407324084489, 4743.217369134089, 4724.362211101509, 4728.527147285261, 4730.526947305277, 4733.242681171013, 4741.454732705714, 4091.5499295077516, 4094.2016306820183, 4095.9385609215888, 4096.549379568275, 4100.0, 6010.879782404328, 6028.457438830526, 6029.758809647653, 6035.7283922223605, 6054.545909056795, 5363.0, 5477.972610136924, 5492.505674489315, 5493.697846618435, 5506.559475241971, 6674.098996635441, 6689.632070236135, 6703.664816759191, 6706.2287836898895, 6744.49416293775, 4466.0844526871915, 4471.150481408522, 4471.306947423154, 4472.373867658531, 4472.463304403493, 6789.7284108635595, 6818.965905170492, 6900.275471075515, 6951.6871740771785, 6972.710048641017, 4482.551744825491, 4488.259437192892, 4492.9775351123035, 4504.684672072989, 4505.324201369821, 4537.115262523776, 4539.523350048264, 4547.136044151601, 4553.157665831765, 4568.565986231302, 5375.19372094189, 5412.134058550613, 5412.539934105645, 5413.593980451482, 5419.3225846769155, 6495.902561461582, 6718.764843230463, 6745.797626071226, 6751.763688270887, 6781.389674929182, 1615.5072702825516, 1662.2353717290182, 1676.312711788161, 1678.5300115967548, 1683.2425408566194, 1040.360178490223, 1042.5412818360048, 1048.0619845238468, 1050.6952983634812, 1063.2982231727178, 6242.656653883989, 6251.12484252205, 6257.78097766576, 6261.530385221035, 6285.59143655661, 6702.664866756642, 6723.630200339028, 6764.594124352555, 6774.559653622498, 6776.288489708608, 6249.9062514062325, 6271.090691849748, 6372.904406433907, 6377.362263773678, 6377.8724425512155, 3740.9438858417147, 3752.568454627698, 3770.132869440044, 3776.9244615107546, 3778.9244215115546, 7121.750738724119, 7171.247019063027, 7205.675744591506, 7210.315020073084, 7218.169910460364, 6944.895826562605, 7047.859042819115, 7097.609631470215, 7118.822029449201, 7119.71521139159, 7155.642217889189, 7168.17565979919, 7173.282671732889, 7177.461690373243, 7194.676239569232, 6857.862842743217, 6879.071325371011, 6884.862302754017, 6887.552309099892, 6915.135608048994, 6685.298043705341, 6708.966455167693, 6774.0, 6795.694193761194, 6884.621345826027, 7240.96379518099, 7291.744788932362, 7317.817054573466, 7328.816779580553, 7334.486585938933, 4524.276115821453, 4550.499445061107, 4556.088782243631, 4558.840440584696, 4574.199515084913, 6847.691853866489, 6925.342092501204, 6950.6177160256675, 6986.126734158231, 7025.297470252934, 6821.693023813841, 6831.897521537082, 6832.282610325844, 6832.897506537306, 6847.965760171167, 6816.216135144522, 6820.829479263058, 6834.043233947351, 6841.076454678555, 6841.24746277919, 6572.211334639683, 6686.29793871656, 6696.732130714717, 6699.933000670126, 6709.899351509634, 6823.727050917908, 6828.7268509259075, 6843.247242803188, 6850.554713943578, 6852.6231057292325, 6661.233958094687, 6662.067310576426, 6674.599524028574, 6674.8998765017595, 6680.966595166993], "yui.html": [760.4030835793901, 814.4258297899981, 857.7812657772267, 871.9433236839601, 884.1026358246377, 14771.261436928151, 15286.464973725922, 15303.464378746747, 15330.540083797476, 15339.616509587251, 14137.222452765094, 14202.218877961708, 14236.430542778277, 14259.857401426008, 14271.286435678227, 808.5027707959607, 811.0834756724893, 817.7791996161033, 817.8568750468673, 818.5620692929284, 801.4630197767481, 803.0203152154362, 804.5132694719698, 805.6414895371562, 807.1766797866173, 845.4166625028711, 849.7280870121564, 849.732334314692, 853.1298075962515, 855.4439614250756, 833.2917020532559, 835.1481488881368, 836.5273620404482, 842.4397775479299, 843.8481073406784, 618.9969050154765, 621.273110460762, 624.2353117431156, 625.0624063904144, 625.7841044839523, 13063.608091757262, 13089.541866034739, 13132.934335328358, 13166.736665266737, 13276.73446531064, 10528.626230276885, 10648.14814814813, 10705.357678539312, 11065.723356916062, 11105.056070234039, 9759.90240097597, 9995.750106247402, 10069.446180460072, 10211.693649190536, 10436.582536698523, 3294.5222942673417, 3308.983455082733, 3336.2993771308056, 3435.1068722132177, 3447.0348302475345, 45988.3101753474, 46194.307085393746, 46301.30548041782, 46317.30524042142, 46397.53602463966, 7549.773506794805, 7587.165411804807, 7652.69389224436, 7696.499727517694, 7807.492512986638, 12157.817632735516, 12176.39118044112, 12187.45156467961, 12200.938995304967, 12230.266184028987, 6802.761903333459, 6816.488763342769, 6876.862462750717, 6979.267176946449, 7068.540544864567, 4310.663694254791, 4348.304271316574, 4354.847580334736, 4429.7120687155875, 4435.645148388121, 2720.6735191777116, 2750.2849259192753, 2753.2428582139673, 2753.408017276295, 2758.6413766210667, 433.3240145373165, 433.55777107350957, 442.8295106384001, 443.09829496973504, 452.8550863723577, 631.3528633151057, 657.1161787395945, 676.9356911093438, 691.1498856406648, 703.5637904499243, 8927.73216803484, 9292.442453452815, 9472.384295020802, 9569.473678947725, 9595.760105997406, 594.7799314253754, 615.6561050085214, 694.6144889586328, 701.8631366883511, 707.8336590901134, 4045.514538255369, 4079.8572049978106, 4087.6116768906904, 4100.835966561304, 4182.247195504778, 59913.704746239375, 60412.395876041555, 60623.69688151531, 60634.39365606287, 60655.69672151611, 47184.5281547187, 47903.28145077827, 47993.76003120032, 48489.272660910116, 48830.26754598684, 46451.30323045157, 47029.0, 47343.76328118406, 47467.28799068017, 48120.518794812306, 8815.294776417999, 9094.909050909406, 9111.134442227978, 9121.863172052557, 9200.171984521425, 34861.65138348584, 35039.299214016086, 35060.0, 35632.46551301681, 35884.0, 41507.792461037505, 47136.29295560638, 47423.28865066958, 47644.52355476401, 48408.75795620999, 8191.549464779256, 8265.173482651928, 8342.708005219789, 8412.957935210285, 8741.388102832741, 12165.452554634885, 12377.381130943597, 12410.503579857066, 12446.751064978831, 13021.283829389096, 10840.837387439353, 10906.836397454203, 11093.611723589636, 11447.313161210353, 11549.307041577533, 11875.52497900109, 11917.34454605005, 12191.634250972485, 12608.243505389706, 12621.116521843383, 10291.53688084023, 11095.0, 11128.88871111311, 11214.719632009264, 11432.885671143182, 9564.139227469283, 9654.469004204837, 9686.56410461545, 9713.854292185764, 9816.803663926825, 8545.916457452726, 8793.824123517366, 9000.279977601907, 9565.569549370155, 9797.755056123653]}, "summary": {"lowerIsBetter": false, "suite": 6783.401164926307, "subtests": {"jquery.html": {"lowerIsBetter": false, "filtered": 7454.959047238257, "unit": "ms", "value": 7454.959047238257}, "dojo.html": {"lowerIsBetter": false, "filtered": 5472.946380593138, "unit": "ms", "value": 5472.946380593138}, "mootools.html": {"lowerIsBetter": false, "filtered": 4341.204599881603, "unit": "ms", "value": 4341.204599881603}, "ext.html": {"lowerIsBetter": false, "filtered": 18015.358704863414, "unit": "ms", "value": 18015.358704863414}, "prototype.html": {"lowerIsBetter": false, "filtered": 4996.406975106771, "unit": "ms", "value": 4996.406975106771}, "yui.html": {"lowerIsBetter": false, "filtered": 6110.432868811464, "unit": "ms", "value": 6110.432868811464}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-067.e"}, "testrun": {"date": 1447767200, "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, 162.0, 162.0, 164.0, 164.0, 160.0, 162.0, 167.0, 169.0, 163.0], "ai-astar": [113.0, 107.0, 110.0, 110.0, 111.0, 124.0, 111.0, 112.0, 109.0, 110.0], "imaging-gaussian-blur": [110.0, 110.0, 111.0, 110.0, 109.0, 110.0, 111.0, 111.0, 110.0, 110.0], "audio-beat-detection": [148.0, 126.0, 148.0, 165.0, 128.0, 152.0, 162.0, 128.0, 166.0, 128.0], "json-stringify-tinderbox": [69.0, 69.0, 69.0, 69.0, 70.0, 70.0, 69.0, 72.0, 71.0, 70.0], "stanford-crypto-pbkdf2": [145.0, 171.0, 158.0, 153.0, 151.0, 140.0, 152.0, 151.0, 142.0, 138.0], "json-parse-financial": [59.0, 59.0, 59.0, 62.0, 60.0, 61.0, 60.0, 60.0, 59.0, 59.0], "stanford-crypto-sha256-iterative": [68.0, 67.0, 66.0, 67.0, 67.0, 69.0, 68.0, 69.0, 65.0, 70.0], "audio-fft": [72.0, 74.0, 76.0, 73.0, 73.0, 73.0, 148.0, 72.0, 72.0, 72.0], "imaging-darkroom": [147.0, 146.0, 146.0, 148.0, 147.0, 147.0, 147.0, 148.0, 149.0, 148.0], "stanford-crypto-ccm": [132.0, 126.0, 122.0, 125.0, 121.0, 116.0, 121.0, 126.0, 124.0, 126.0], "audio-oscillator": [91.0, 91.0, 136.0, 93.0, 93.0, 91.0, 145.0, 91.0, 91.0, 134.0], "stanford-crypto-aes": [95.0, 88.0, 86.0, 95.0, 86.0, 86.0, 87.0, 87.0, 88.0, 86.0], "imaging-desaturate": [98.0, 97.0, 97.0, 97.0, 97.0, 96.0, 96.0, 96.0, 96.0, 96.0]}, "summary": {"lowerIsBetter": true, "suite": 1520.0000000000002, "subtests": {"audio-fft": {"lowerIsBetter": true, "filtered": 80.5, "unit": "ms", "value": 80.5}, "stanford-crypto-pbkdf2": {"lowerIsBetter": true, "filtered": 150.1, "unit": "ms", "value": 150.1}, "audio-beat-detection": {"lowerIsBetter": true, "filtered": 145.1, "unit": "ms", "value": 145.1}, "stanford-crypto-ccm": {"lowerIsBetter": true, "filtered": 123.9, "unit": "ms", "value": 123.9}, "imaging-darkroom": {"lowerIsBetter": true, "filtered": 147.3, "unit": "ms", "value": 147.3}, "json-parse-financial": {"lowerIsBetter": true, "filtered": 59.8, "unit": "ms", "value": 59.8}, "audio-oscillator": {"lowerIsBetter": true, "filtered": 105.6, "unit": "ms", "value": 105.6}, "ai-astar": {"lowerIsBetter": true, "filtered": 111.7, "unit": "ms", "value": 111.7}, "audio-dft": {"lowerIsBetter": true, "filtered": 163.4, "unit": "ms", "value": 163.4}, "stanford-crypto-sha256-iterative": {"lowerIsBetter": true, "filtered": 67.6, "unit": "ms", "value": 67.6}, "json-stringify-tinderbox": {"lowerIsBetter": true, "filtered": 69.8, "unit": "ms", "value": 69.8}, "imaging-gaussian-blur": {"lowerIsBetter": true, "filtered": 110.2, "unit": "ms", "value": 110.2}, "stanford-crypto-aes": {"lowerIsBetter": true, "filtered": 88.4, "unit": "ms", "value": 88.4}, "imaging-desaturate": {"lowerIsBetter": true, "filtered": 96.6, "unit": "ms", "value": 96.6}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-067.e"}, "testrun": {"date": 1447767200, "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.38619222587508], "Encrypt": [281.0567734682406], "NavierStokes": [4859.223300970873], "Decrypt": [5060.606060606061], "Splay": [626.5664160401003], "Richards": [162.57519102584945], "RegExp": [25400.0], "Earley": [718.3908045977012], "Boyer": [11964.285714285714], "RayTrace": [1071.8113612004288]}, "summary": {"lowerIsBetter": false, "suite": 21336.357329507242, "subtests": {"DeltaBlue": {"lowerIsBetter": false, "filtered": 341.896178, "unit": "score", "value": 341.896178}, "Encrypt": {"lowerIsBetter": false, "filtered": 947.0719979999998, "unit": "score", "value": 947.0719979999998}, "NavierStokes": {"lowerIsBetter": false, "filtered": 305.39860139860156, "unit": "score", "value": 305.39860139860156}, "Decrypt": {"lowerIsBetter": false, "filtered": 52.59864071856286, "unit": "score", "value": 52.59864071856286}, "Splay": {"lowerIsBetter": false, "filtered": 130.05963599999995, "unit": "score", "value": 130.05963599999995}, "RegExp": {"lowerIsBetter": false, "filtered": 35.86555118110237, "unit": "score", "value": 35.86555118110237}, "Richards": {"lowerIsBetter": false, "filtered": 217.14260199999998, "unit": "score", "value": 217.14260199999998}, "Earley": {"lowerIsBetter": false, "filtered": 927.7164960000002, "unit": "score", "value": 927.7164960000002}, "Boyer": {"lowerIsBetter": false, "filtered": 55.704370149253705, "unit": "score", "value": 55.704370149253705}, "RayTrace": {"lowerIsBetter": false, "filtered": 690.4097369999998, "unit": "score", "value": 690.4097369999998}}}, "test_machine": {"platform": "x86_64", "osversion": "Ubuntu 12.04.e", "os": "linux", "name": "talos-linux64-ix-067.e"}, "testrun": {"date": 1447767200, "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:30 INFO - RETURN: dromaeo_css: 6783.40 05:53:30 INFO - RETURN: kraken: 1520.00 05:53:30 INFO - RETURN: v8_7: 21336.36 05:53:30 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,1,43]]", "result": "21336.36"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,43]]", "result": "1520.00"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,43]]", "result": "6783.40"}}} 05:53:30 INFO - Return code: 0 05:53:30 INFO - # TBPL SUCCESS # 05:53:30 INFO - Running post-action listener: _resource_record_post_action 05:53:30 INFO - Running post-run listener: _resource_record_post_run 05:53:31 INFO - Total resource usage - Wall time: 1225s; CPU: 13.0%; Read bytes: 69632; Write bytes: 514461696; Read time: 428; Write time: 542048 05:53:31 INFO - install - Wall time: 15s; CPU: 15.0%; Read bytes: 4096; Write bytes: 227332096; Read time: 192; Write time: 363568 05:53:31 INFO - run-tests - Wall time: 1211s; CPU: 13.0%; Read bytes: 65536; Write bytes: 287129600; Read time: 236; Write time: 178480 05:53:31 INFO - Running post-run listener: _upload_blobber_files 05:53:31 INFO - Blob upload gear active. 05:53:31 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 05:53:31 INFO - Copying logs to upload dir... 05:53:31 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs program finished with exit code 0 elapsedTime=1262.582932 ========= master_lag: 0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 2 secs) (at 2015-11-17 05:53:31.349937) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-17 05:53:31.355327) ========= 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=3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301 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.010036 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:31.406738) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:53:31.407110) ========= 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=3e14eba40af1795cf0357910000001c3-1447767147.412957-1494372301 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004491 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-17 05:53:31.456932) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-17 05:53:31.457244) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-17 05:53:31.457544) ========= ========= Total master_lag: 0.20 =========