builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-061 starttime: 1457233205.71 results: success (0) buildid: 20160305163006 builduid: 015caf4a08c04960ab8eba65fad788d5 revision: 8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:05.712924) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:05.713325) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:05.713604) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006507 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.89 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:06.613569) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-03-05 19:00:06.613871) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 1 secs) (at 2016-03-05 19:00:08.186701) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:08.186966) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.005109 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:08.248620) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:08.251472) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:08.251826) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:08.252099) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-05 19:00:09-- 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% 67.8M=0s 2016-03-05 19:00:09 (67.8 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.125113 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:08.399606) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:08.403393) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.013797 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:08.455279) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:08.455600) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32 --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=516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-05 19:00:09,566 truncating revision to first 12 chars 2016-03-05 19:00:09,566 Setting DEBUG logging. 2016-03-05 19:00:09,566 attempt 1/10 2016-03-05 19:00:09,566 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/8fd2d0f7ce49?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-05 19:00:09,844 unpacking tar archive at: mozilla-inbound-8fd2d0f7ce49/testing/mozharness/ program finished with exit code 0 elapsedTime=0.602463 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:09.073239) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:09.073545) ========= echo 8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32'] 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=516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32 program finished with exit code 0 elapsedTime=0.004209 script_repo_revision: '8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:09.126282) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:09.126573) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-05 19:00:09.148306) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-03-05 19:00:09.148550) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] 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=516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 19:00:10 INFO - MultiFileLogger online at 20160305 19:00:10 in /builds/slave/test-pgo 19:00:10 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 19:00:10 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 19:00:10 INFO - {'append_to_log': False, 19:00:10 INFO - 'base_work_dir': '/builds/slave/test-pgo', 19:00:10 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 19:00:10 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 19:00:10 INFO - 'branch': 'Mozilla-Inbound', 19:00:10 INFO - 'buildbot_json_path': 'buildprops.json', 19:00:10 INFO - 'config_files': ('talos/linux_config.py',), 19:00:10 INFO - 'default_actions': ('clobber', 19:00:10 INFO - 'read-buildbot-config', 19:00:10 INFO - 'download-and-extract', 19:00:10 INFO - 'populate-webroot', 19:00:10 INFO - 'create-virtualenv', 19:00:10 INFO - 'install', 19:00:10 INFO - 'run-tests'), 19:00:10 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 19:00:10 INFO - 'download_minidump_stackwalk': True, 19:00:10 INFO - 'download_symbols': 'ondemand', 19:00:10 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 19:00:10 INFO - 'tooltool.py': '/tools/tooltool.py', 19:00:10 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 19:00:10 INFO - '/tools/misc-python/virtualenv.py')}, 19:00:10 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 19:00:10 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 19:00:10 INFO - 'installer_path': 'installer.exe', 19:00:10 INFO - 'log_level': 'info', 19:00:10 INFO - 'log_name': 'talos', 19:00:10 INFO - 'log_to_console': True, 19:00:10 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 19:00:10 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 19:00:10 INFO - 'opt_config_files': (), 19:00:10 INFO - 'pip_index': False, 19:00:10 INFO - 'sps_profile': False, 19:00:10 INFO - 'sps_profile_interval': 0, 19:00:10 INFO - 'suite': 'dromaeojs', 19:00:10 INFO - 'system_bits': '32', 19:00:10 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 19:00:10 INFO - 'title': 'talos-linux64-ix-061', 19:00:10 INFO - 'tooltool_cache': '/builds/tooltool_cache', 19:00:10 INFO - 'use_talos_json': True, 19:00:10 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 19:00:10 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 19:00:10 INFO - 'work_dir': 'build'} 19:00:10 INFO - ##### 19:00:10 INFO - ##### Running clobber step. 19:00:10 INFO - ##### 19:00:10 INFO - Running pre-action listener: _resource_record_pre_action 19:00:10 INFO - Running main action method: clobber 19:00:10 INFO - rmtree: /builds/slave/test-pgo/build 19:00:10 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 19:00:10 INFO - Running post-action listener: _resource_record_post_action 19:00:10 INFO - ##### 19:00:10 INFO - ##### Running read-buildbot-config step. 19:00:10 INFO - ##### 19:00:10 INFO - Running pre-action listener: _resource_record_pre_action 19:00:10 INFO - Running main action method: read_buildbot_config 19:00:10 INFO - Using buildbot properties: 19:00:10 INFO - { 19:00:10 INFO - "project": "", 19:00:10 INFO - "product": "firefox", 19:00:10 INFO - "script_repo_revision": "production", 19:00:10 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs", 19:00:10 INFO - "repository": "", 19:00:10 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs", 19:00:10 INFO - "buildid": "20160305163006", 19:00:10 INFO - "pgo_build": "True", 19:00:10 INFO - "basedir": "/builds/slave/test-pgo", 19:00:10 INFO - "buildnumber": 744, 19:00:10 INFO - "slavename": "talos-linux64-ix-061", 19:00:10 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 19:00:10 INFO - "platform": "ubuntu64_hw", 19:00:10 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 19:00:10 INFO - "branch": "mozilla-inbound", 19:00:10 INFO - "repo_path": "integration/mozilla-inbound", 19:00:10 INFO - "revision": "8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32", 19:00:10 INFO - "stage_platform": "linux64-pgo", 19:00:10 INFO - "builduid": "015caf4a08c04960ab8eba65fad788d5", 19:00:10 INFO - "slavebuilddir": "test" 19:00:10 INFO - } 19:00:10 INFO - Found installer url https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 19:00:10 INFO - Running post-action listener: _resource_record_post_action 19:00:10 INFO - ##### 19:00:10 INFO - ##### Running download-and-extract step. 19:00:10 INFO - ##### 19:00:10 INFO - Running pre-action listener: _resource_record_pre_action 19:00:10 INFO - Running main action method: download_and_extract 19:00:10 INFO - mkdir: /builds/slave/test-pgo/build/tests 19:00:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:10 INFO - https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 19:00:10 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 19:00:10 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 19:00:10 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 19:00:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 19:00:14 INFO - Downloaded 1448 bytes. 19:00:14 INFO - Reading from file /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.test_packages.json 19:00:14 INFO - Using the following test package requirements: 19:00:14 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 19:00:14 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 19:00:14 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 19:00:14 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 19:00:14 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 19:00:14 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 19:00:14 INFO - u'jsshell-linux-x86_64.zip'], 19:00:14 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 19:00:14 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 19:00:14 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 19:00:14 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 19:00:14 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 19:00:14 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 19:00:14 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 19:00:14 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 19:00:14 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 19:00:14 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 19:00:14 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 19:00:14 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 19:00:14 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 19:00:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:14 INFO - https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:00:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 19:00:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 19:00:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 19:00:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:00:20 INFO - Downloaded 23401640 bytes. 19:00:20 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 19:00:20 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 19:00:21 INFO - Return code: 0 19:00:21 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 19:00:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:21 INFO - https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 19:00:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 19:00:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 19:00:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 19:00:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 19:00:23 INFO - Downloaded 23401640 bytes. 19:00:23 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 19:00:23 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 19:00:24 INFO - Return code: 0 19:00:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:24 INFO - https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 19:00:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 19:00:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 19:00:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 19:00:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 19:00:25 INFO - Downloaded 10845161 bytes. 19:00:25 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 19:00:25 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 19:00:26 INFO - Return code: 0 19:00:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:26 INFO - https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 19:00:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 19:00:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 19:00:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 19:00:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 19:00:27 INFO - Downloaded 56182924 bytes. 19:00:27 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 19:00:27 INFO - mkdir: /builds/slave/test-pgo/properties 19:00:27 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 19:00:27 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 19:00:27 INFO - Contents: 19:00:27 INFO - build_url:https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 19:00:28 INFO - Running post-action listener: _resource_record_post_action 19:00:28 INFO - Running post-action listener: set_extra_try_arguments 19:00:28 INFO - ##### 19:00:28 INFO - ##### Running populate-webroot step. 19:00:28 INFO - ##### 19:00:28 INFO - Running pre-action listener: _resource_record_pre_action 19:00:28 INFO - Running main action method: populate_webroot 19:00:28 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 19:00:28 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 19:00:28 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 19:00:28 INFO - '--tppagecycles', 19:00:28 INFO - '7'], 19:00:28 INFO - 'tests': ['tsvgm']}}, 19:00:28 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 19:00:28 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 19:00:28 INFO - 'tests': ['tresize', 'tcanvasmark']}, 19:00:28 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 19:00:28 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 19:00:28 INFO - 'tests': ['dromaeo_css', 'kraken']}, 19:00:28 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:00:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:00:28 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:00:28 INFO - 'talos_options': ['--e10s'], 19:00:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 19:00:28 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:00:28 INFO - 'tests': ['damp', 'tps']}, 19:00:28 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:00:28 INFO - 'talos_options': ['--e10s'], 19:00:28 INFO - 'tests': ['damp', 'tps']}, 19:00:28 INFO - 'g3': {'tests': ['dromaeo_dom']}, 19:00:28 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 19:00:28 INFO - 'other': {'tests': ['a11yr', 19:00:28 INFO - 'ts_paint', 19:00:28 INFO - 'tpaint', 19:00:28 INFO - 'sessionrestore', 19:00:28 INFO - 'sessionrestore_no_auto_restore', 19:00:28 INFO - 'tabpaint']}, 19:00:28 INFO - 'other-e10s': {'talos_options': ['--e10s'], 19:00:28 INFO - 'tests': ['a11yr', 19:00:28 INFO - 'ts_paint', 19:00:28 INFO - 'tpaint', 19:00:28 INFO - 'sessionrestore', 19:00:28 INFO - 'sessionrestore_no_auto_restore', 19:00:28 INFO - 'tabpaint']}, 19:00:28 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 19:00:28 INFO - 'tests': ['a11yr', 19:00:28 INFO - 'ts_paint', 19:00:28 INFO - 'tpaint', 19:00:28 INFO - 'sessionrestore', 19:00:28 INFO - 'sessionrestore_no_auto_restore', 19:00:28 INFO - 'tabpaint']}, 19:00:28 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 19:00:28 INFO - 'tests': ['a11yr', 19:00:28 INFO - 'ts_paint', 19:00:28 INFO - 'tpaint', 19:00:28 INFO - 'sessionrestore', 19:00:28 INFO - 'sessionrestore_no_auto_restore', 19:00:28 INFO - 'tabpaint']}, 19:00:28 INFO - 'other_l64': {'tests': ['a11yr', 19:00:28 INFO - 'ts_paint', 19:00:28 INFO - 'tpaint', 19:00:28 INFO - 'sessionrestore', 19:00:28 INFO - 'sessionrestore_no_auto_restore', 19:00:28 INFO - 'tabpaint']}, 19:00:28 INFO - 'other_nol64': {'tests': ['a11yr', 19:00:28 INFO - 'ts_paint', 19:00:28 INFO - 'tpaint', 19:00:28 INFO - 'sessionrestore', 19:00:28 INFO - 'sessionrestore_no_auto_restore', 19:00:28 INFO - 'tabpaint']}, 19:00:28 INFO - 'svgr': {'tests': ['tsvgx', 19:00:28 INFO - 'tsvgr_opacity', 19:00:28 INFO - 'tart', 19:00:28 INFO - 'tscrollx', 19:00:28 INFO - 'cart']}, 19:00:28 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 19:00:28 INFO - 'tests': ['tsvgx', 19:00:28 INFO - 'tsvgr_opacity', 19:00:28 INFO - 'tart', 19:00:28 INFO - 'tscrollx', 19:00:28 INFO - 'cart']}, 19:00:28 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:00:28 INFO - 'tests': ['tp5o']}, 19:00:28 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:00:28 INFO - 'talos_options': ['--e10s'], 19:00:28 INFO - 'tests': ['tp5o']}, 19:00:28 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:00:28 INFO - 'talos_options': ['--xperf_path', 19:00:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:00:28 INFO - 'tests': ['tp5n']}, 19:00:28 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 19:00:28 INFO - 'talos_options': ['--e10s', 19:00:28 INFO - '--xperf_path', 19:00:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 19:00:28 INFO - 'tests': ['tp5n']}}, 19:00:28 INFO - 'talos.zip': {'path': '', 19:00:28 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 19:00:28 INFO - Running post-action listener: _resource_record_post_action 19:00:28 INFO - ##### 19:00:28 INFO - ##### Running create-virtualenv step. 19:00:28 INFO - ##### 19:00:28 INFO - Running pre-action listener: _resource_record_pre_action 19:00:28 INFO - Running main action method: create_virtualenv 19:00:28 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 19:00:28 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 19:00:28 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 19:00:28 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 19:00:28 INFO - Using real prefix '/usr' 19:00:28 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 19:00:28 INFO - Installing distribute.............................................................................................................................................................................................done. 19:00:30 INFO - Installing pip.................done. 19:00:30 INFO - Return code: 0 19:00:30 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 19:00: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')]} 19:00:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:00:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00: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')]} 19:00:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:00:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:30 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7fdb76d9ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10626d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, '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': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:00:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 19:00:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 19:00:30 INFO - Using env: {'DISPLAY': ':0', 19:00:30 INFO - 'HOME': '/home/cltbld', 19:00:30 INFO - 'LANG': 'en_US.UTF-8', 19:00:30 INFO - 'LANGUAGE': 'en_US:en', 19:00:30 INFO - 'LOGNAME': 'cltbld', 19:00:30 INFO - 'MAIL': '/var/mail/cltbld', 19:00:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:00:30 INFO - 'MOZ_NO_REMOTE': '1', 19:00:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:00:30 INFO - 'NO_EM_RESTART': '1', 19:00:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:00:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:00:30 INFO - 'PWD': '/builds/slave/test-pgo', 19:00:30 INFO - 'SHELL': '/bin/bash', 19:00:30 INFO - 'SHLVL': '1', 19:00:30 INFO - 'TERM': 'linux', 19:00:30 INFO - 'TMOUT': '86400', 19:00:30 INFO - 'USER': 'cltbld', 19:00:30 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:00:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:00:30 INFO - '_': '/tools/buildbot/bin/python'} 19:00:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:00:30 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 19:00:30 INFO - Cleaning up... 19:00:30 INFO - Return code: 0 19:00:30 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 19:00: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')]} 19:00:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:00:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00: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')]} 19:00:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:00:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:30 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7fdb76d9ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10626d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, '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': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:00:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 19:00:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 19:00:30 INFO - Using env: {'DISPLAY': ':0', 19:00:30 INFO - 'HOME': '/home/cltbld', 19:00:30 INFO - 'LANG': 'en_US.UTF-8', 19:00:30 INFO - 'LANGUAGE': 'en_US:en', 19:00:30 INFO - 'LOGNAME': 'cltbld', 19:00:30 INFO - 'MAIL': '/var/mail/cltbld', 19:00:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:00:30 INFO - 'MOZ_NO_REMOTE': '1', 19:00:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:00:30 INFO - 'NO_EM_RESTART': '1', 19:00:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:00:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:00:30 INFO - 'PWD': '/builds/slave/test-pgo', 19:00:30 INFO - 'SHELL': '/bin/bash', 19:00:30 INFO - 'SHLVL': '1', 19:00:30 INFO - 'TERM': 'linux', 19:00:30 INFO - 'TMOUT': '86400', 19:00:30 INFO - 'USER': 'cltbld', 19:00:30 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:00:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:00:30 INFO - '_': '/tools/buildbot/bin/python'} 19:00:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:00:31 INFO - Downloading/unpacking psutil>=0.7.1 19:00:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:32 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 19:00:33 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:00:33 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:00:33 INFO - Installing collected packages: psutil 19:00:33 INFO - Running setup.py install for psutil 19:00:33 INFO - building 'psutil._psutil_linux' extension 19:00:33 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 19:00:33 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 19:00:33 INFO - building 'psutil._psutil_posix' extension 19:00:33 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 19:00:33 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 19:00:33 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 19:00:33 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 19:00:33 INFO - Successfully installed psutil 19:00:33 INFO - Cleaning up... 19:00:33 INFO - Return code: 0 19:00:33 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 19:00: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')]} 19:00:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:00:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00: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')]} 19:00:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:00:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:33 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7fdb76d9ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10626d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, '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': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:00:33 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 19:00:33 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 19:00:33 INFO - Using env: {'DISPLAY': ':0', 19:00:33 INFO - 'HOME': '/home/cltbld', 19:00:33 INFO - 'LANG': 'en_US.UTF-8', 19:00:33 INFO - 'LANGUAGE': 'en_US:en', 19:00:33 INFO - 'LOGNAME': 'cltbld', 19:00:33 INFO - 'MAIL': '/var/mail/cltbld', 19:00:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:00:33 INFO - 'MOZ_NO_REMOTE': '1', 19:00:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:00:33 INFO - 'NO_EM_RESTART': '1', 19:00:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:00:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:00:33 INFO - 'PWD': '/builds/slave/test-pgo', 19:00:33 INFO - 'SHELL': '/bin/bash', 19:00:33 INFO - 'SHLVL': '1', 19:00:33 INFO - 'TERM': 'linux', 19:00:33 INFO - 'TMOUT': '86400', 19:00:33 INFO - 'USER': 'cltbld', 19:00:33 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:00:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:00:33 INFO - '_': '/tools/buildbot/bin/python'} 19:00:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:00:33 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 19:00:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:35 INFO - Downloading mozsystemmonitor-0.0.tar.gz 19:00:35 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 19:00:35 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 19:00:35 INFO - Installing collected packages: mozsystemmonitor 19:00:35 INFO - Running setup.py install for mozsystemmonitor 19:00:35 INFO - Successfully installed mozsystemmonitor 19:00:35 INFO - Cleaning up... 19:00:35 INFO - Return code: 0 19:00:35 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 19:00:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:00:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:00:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:35 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7fdb76d9ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10626d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, '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': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:00:35 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 19:00:35 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 19:00:35 INFO - Using env: {'DISPLAY': ':0', 19:00:35 INFO - 'HOME': '/home/cltbld', 19:00:35 INFO - 'LANG': 'en_US.UTF-8', 19:00:35 INFO - 'LANGUAGE': 'en_US:en', 19:00:35 INFO - 'LOGNAME': 'cltbld', 19:00:35 INFO - 'MAIL': '/var/mail/cltbld', 19:00:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:00:35 INFO - 'MOZ_NO_REMOTE': '1', 19:00:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:00:35 INFO - 'NO_EM_RESTART': '1', 19:00:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:00:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:00:35 INFO - 'PWD': '/builds/slave/test-pgo', 19:00:35 INFO - 'SHELL': '/bin/bash', 19:00:35 INFO - 'SHLVL': '1', 19:00:35 INFO - 'TERM': 'linux', 19:00:35 INFO - 'TMOUT': '86400', 19:00:35 INFO - 'USER': 'cltbld', 19:00:35 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:00:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:00:35 INFO - '_': '/tools/buildbot/bin/python'} 19:00:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:00:36 INFO - Downloading/unpacking blobuploader==1.2.4 19:00:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:37 INFO - Downloading blobuploader-1.2.4.tar.gz 19:00:37 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 19:00:37 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 19:00:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:37 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:37 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:37 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:37 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:38 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 19:00:38 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 19:00:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:38 INFO - Downloading docopt-0.6.1.tar.gz 19:00:38 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 19:00:38 INFO - Installing collected packages: blobuploader, requests, docopt 19:00:38 INFO - Running setup.py install for blobuploader 19:00:38 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 19:00:38 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 19:00:38 INFO - Running setup.py install for requests 19:00:39 INFO - Running setup.py install for docopt 19:00:39 INFO - Successfully installed blobuploader requests docopt 19:00:39 INFO - Cleaning up... 19:00:39 INFO - Return code: 0 19:00:39 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:00:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:00:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:00:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:39 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--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 0x7fdb76d9ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10626d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, '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': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:00:39 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 19:00:39 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:00:39 INFO - Using env: {'DISPLAY': ':0', 19:00:39 INFO - 'HOME': '/home/cltbld', 19:00:39 INFO - 'LANG': 'en_US.UTF-8', 19:00:39 INFO - 'LANGUAGE': 'en_US:en', 19:00:39 INFO - 'LOGNAME': 'cltbld', 19:00:39 INFO - 'MAIL': '/var/mail/cltbld', 19:00:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:00:39 INFO - 'MOZ_NO_REMOTE': '1', 19:00:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:00:39 INFO - 'NO_EM_RESTART': '1', 19:00:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:00:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:00:39 INFO - 'PWD': '/builds/slave/test-pgo', 19:00:39 INFO - 'SHELL': '/bin/bash', 19:00:39 INFO - 'SHLVL': '1', 19:00:39 INFO - 'TERM': 'linux', 19:00:39 INFO - 'TMOUT': '86400', 19:00:39 INFO - 'USER': 'cltbld', 19:00:39 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:00:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:00:39 INFO - '_': '/tools/buildbot/bin/python'} 19:00:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:00:39 INFO - Running setup.py (path:/tmp/pip-4_O2ln-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:00:39 INFO - Running setup.py (path:/tmp/pip-w_IRQE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:00:39 INFO - Running setup.py (path:/tmp/pip-W2bYQx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:00:39 INFO - Running setup.py (path:/tmp/pip-vzEA1p-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 19:00:39 INFO - Running setup.py (path:/tmp/pip-xPPw70-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:00:39 INFO - Running setup.py (path:/tmp/pip-M1x3wT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:00:39 INFO - Running setup.py (path:/tmp/pip-v1Eoyq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:00:39 INFO - Running setup.py (path:/tmp/pip-O7bgVt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 19:00:39 INFO - Running setup.py (path:/tmp/pip-pa7ZH5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 19:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 19:00:40 INFO - Running setup.py (path:/tmp/pip-wZ1IsV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 19:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:00:40 INFO - Running setup.py (path:/tmp/pip-5C_blJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:00:40 INFO - Running setup.py (path:/tmp/pip-mMAZ2J-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:00:40 INFO - Running setup.py (path:/tmp/pip-WoqgSy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:00:40 INFO - Running setup.py (path:/tmp/pip-1PJ31M-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:00:40 INFO - Running setup.py (path:/tmp/pip-f_oKJm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 19:00:40 INFO - Running setup.py (path:/tmp/pip-5SDtdZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 19:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 19:00:40 INFO - Running setup.py (path:/tmp/pip-r3_XmX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 19:00:40 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 19:00:40 INFO - Running setup.py install for manifestparser 19:00:40 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 19:00:40 INFO - Running setup.py install for mozcrash 19:00:40 INFO - Running setup.py install for mozdebug 19:00:40 INFO - Running setup.py install for mozdevice 19:00:41 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Running setup.py install for mozfile 19:00:41 INFO - Running setup.py install for mozhttpd 19:00:41 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Running setup.py install for mozinfo 19:00:41 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Running setup.py install for mozInstall 19:00:41 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Running setup.py install for mozleak 19:00:41 INFO - Running setup.py install for mozlog 19:00:41 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Running setup.py install for moznetwork 19:00:41 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Running setup.py install for mozprocess 19:00:41 INFO - Running setup.py install for mozprofile 19:00:41 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 19:00:41 INFO - Running setup.py install for mozrunner 19:00:42 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 19:00:42 INFO - Running setup.py install for mozscreenshot 19:00:42 INFO - Running setup.py install for moztest 19:00:42 INFO - Running setup.py install for mozversion 19:00:42 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 19:00:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 19:00:42 INFO - Cleaning up... 19:00:42 INFO - Return code: 0 19:00:42 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:00: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')]} 19:00:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:00:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00: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')]} 19:00:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:00:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:42 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7fdb76d9ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10626d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, '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': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:00:42 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/config 19:00:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:00:42 INFO - Using env: {'DISPLAY': ':0', 19:00:42 INFO - 'HOME': '/home/cltbld', 19:00:42 INFO - 'LANG': 'en_US.UTF-8', 19:00:42 INFO - 'LANGUAGE': 'en_US:en', 19:00:42 INFO - 'LOGNAME': 'cltbld', 19:00:42 INFO - 'MAIL': '/var/mail/cltbld', 19:00:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:00:42 INFO - 'MOZ_NO_REMOTE': '1', 19:00:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:00:42 INFO - 'NO_EM_RESTART': '1', 19:00:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:00:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:00:42 INFO - 'PWD': '/builds/slave/test-pgo', 19:00:42 INFO - 'SHELL': '/bin/bash', 19:00:42 INFO - 'SHLVL': '1', 19:00:42 INFO - 'TERM': 'linux', 19:00:42 INFO - 'TMOUT': '86400', 19:00:42 INFO - 'USER': 'cltbld', 19:00:42 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:00:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:00:42 INFO - '_': '/tools/buildbot/bin/python'} 19:00:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:00:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:00:42 INFO - Running setup.py (path:/tmp/pip-_vRc4r-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 19:00:42 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 1)) 19:00:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:00:42 INFO - Running setup.py (path:/tmp/pip-XlX9Zm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 19:00:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 19:00:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:00:42 INFO - Running setup.py (path:/tmp/pip-ZdJ0CZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 19:00:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 19:00:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:00:42 INFO - Running setup.py (path:/tmp/pip-IjytAV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 19:00:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 19:00:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 19:00:42 INFO - Running setup.py (path:/tmp/pip-fdn4NI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 19:00:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 5)) 19:00:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:00:42 INFO - Running setup.py (path:/tmp/pip-8D9XTS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 6)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:00:43 INFO - Running setup.py (path:/tmp/pip-UhHA9Y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 7)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:00:43 INFO - Running setup.py (path:/tmp/pip-3A5g72-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 8)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 19:00:43 INFO - Running setup.py (path:/tmp/pip-DoeyVN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 9)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 19:00:43 INFO - Running setup.py (path:/tmp/pip-4igEIn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:00:43 INFO - Running setup.py (path:/tmp/pip-lanmBV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 11)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:00:43 INFO - Running setup.py (path:/tmp/pip-ieHruy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 12)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:00:43 INFO - Running setup.py (path:/tmp/pip-0TVCDk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 13)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:00:43 INFO - Running setup.py (path:/tmp/pip-qXCHFj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 14)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:00:43 INFO - Running setup.py (path:/tmp/pip-A038qY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 15)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 19:00:43 INFO - Running setup.py (path:/tmp/pip-ayiTtj-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test-pgo/build/tests/mozbase/moztest in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 16)) 19:00:43 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 19:00:43 INFO - Running setup.py (path:/tmp/pip-Y02LhD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 17)) 19:00:43 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.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 19:00:43 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.17->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 19:00:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 3)) 19:00:43 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.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 19:00:43 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.48->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 4)) 19:00:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 19:00:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:45 INFO - Downloading blessings-1.6.tar.gz 19:00:45 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 19:00:45 INFO - Installing collected packages: blessings 19:00:45 INFO - Running setup.py install for blessings 19:00:45 INFO - Successfully installed blessings 19:00:45 INFO - Cleaning up... 19:00:45 INFO - Return code: 0 19:00:45 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 19:00:45 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 19:00:45 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 19:00:46 INFO - Reading from file tmpfile_stdout 19:00:46 INFO - Current package versions: 19:00:46 INFO - argparse == 1.2.1 19:00:46 INFO - blessings == 1.6 19:00:46 INFO - blobuploader == 1.2.4 19:00:46 INFO - docopt == 0.6.1 19:00:46 INFO - manifestparser == 1.1 19:00:46 INFO - mozInstall == 1.12 19:00:46 INFO - mozcrash == 0.17 19:00:46 INFO - mozdebug == 0.1 19:00:46 INFO - mozdevice == 0.48 19:00:46 INFO - mozfile == 1.2 19:00:46 INFO - mozhttpd == 0.7 19:00:46 INFO - mozinfo == 0.9 19:00:46 INFO - mozleak == 0.1 19:00:46 INFO - mozlog == 3.1 19:00:46 INFO - moznetwork == 0.27 19:00:46 INFO - mozprocess == 0.22 19:00:46 INFO - mozprofile == 0.28 19:00:46 INFO - mozrunner == 6.11 19:00:46 INFO - mozscreenshot == 0.1 19:00:46 INFO - mozsystemmonitor == 0.0 19:00:46 INFO - moztest == 0.7 19:00:46 INFO - mozversion == 1.4 19:00:46 INFO - psutil == 3.1.1 19:00:46 INFO - requests == 1.2.3 19:00:46 INFO - wsgiref == 0.1.2 19:00:46 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 19:00:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:00:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:00:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:46 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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 0x7fdb76d9ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10626d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, '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': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:00:46 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test-pgo/build/tests/talos 19:00:46 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 -r /builds/slave/test-pgo/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 19:00:46 INFO - Using env: {'DISPLAY': ':0', 19:00:46 INFO - 'HOME': '/home/cltbld', 19:00:46 INFO - 'LANG': 'en_US.UTF-8', 19:00:46 INFO - 'LANGUAGE': 'en_US:en', 19:00:46 INFO - 'LOGNAME': 'cltbld', 19:00:46 INFO - 'MAIL': '/var/mail/cltbld', 19:00:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:00:46 INFO - 'MOZ_NO_REMOTE': '1', 19:00:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:00:46 INFO - 'NO_EM_RESTART': '1', 19:00:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:00:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:00:46 INFO - 'PWD': '/builds/slave/test-pgo', 19:00:46 INFO - 'SHELL': '/bin/bash', 19:00:46 INFO - 'SHLVL': '1', 19:00:46 INFO - 'TERM': 'linux', 19:00:46 INFO - 'TMOUT': '86400', 19:00:46 INFO - 'USER': 'cltbld', 19:00:46 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:00:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:00:46 INFO - '_': '/tools/buildbot/bin/python'} 19:00:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:00:46 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.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 1)) 19:00:46 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 2)) 19:00:46 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 3)) 19:00:46 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 4)) 19:00:46 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 5)) 19:00:46 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 6)) 19:00:46 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 7)) 19:00:46 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 8)) 19:00:46 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 9)) 19:00:46 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.1->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 1)) 19:00:46 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 4)) 19:00:46 INFO - Cleaning up... 19:00:46 INFO - Return code: 0 19:00:46 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 19:00:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:00:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:00:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:46 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdb76d9ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10626d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, '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': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:00:46 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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', 'jsonschema'] in /builds/slave/test-pgo/build 19:00:46 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 jsonschema 19:00:46 INFO - Using env: {'DISPLAY': ':0', 19:00:46 INFO - 'HOME': '/home/cltbld', 19:00:46 INFO - 'LANG': 'en_US.UTF-8', 19:00:46 INFO - 'LANGUAGE': 'en_US:en', 19:00:46 INFO - 'LOGNAME': 'cltbld', 19:00:46 INFO - 'MAIL': '/var/mail/cltbld', 19:00:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:00:46 INFO - 'MOZ_NO_REMOTE': '1', 19:00:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:00:46 INFO - 'NO_EM_RESTART': '1', 19:00:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:00:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:00:46 INFO - 'PWD': '/builds/slave/test-pgo', 19:00:46 INFO - 'SHELL': '/bin/bash', 19:00:46 INFO - 'SHLVL': '1', 19:00:46 INFO - 'TERM': 'linux', 19:00:46 INFO - 'TMOUT': '86400', 19:00:46 INFO - 'USER': 'cltbld', 19:00:46 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:00:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:00:46 INFO - '_': '/tools/buildbot/bin/python'} 19:00:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:00:46 INFO - Downloading/unpacking jsonschema 19:00:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:46 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:46 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:46 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:46 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:48 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 19:00:48 INFO - Downloading/unpacking functools32 (from jsonschema) 19:00:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:48 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:48 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:48 INFO - Downloading functools32-3.2.3-2.tar.gz 19:00:48 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 19:00:48 INFO - warning: no files found matching '*.txt' 19:00:48 INFO - no previously-included directories found matching 'build' 19:00:48 INFO - no previously-included directories found matching 'dist' 19:00:48 INFO - no previously-included directories found matching '.git*' 19:00:48 INFO - Installing collected packages: jsonschema, functools32 19:00:48 INFO - Running setup.py install for functools32 19:00:48 INFO - warning: no files found matching '*.txt' 19:00:48 INFO - no previously-included directories found matching 'build' 19:00:48 INFO - no previously-included directories found matching 'dist' 19:00:48 INFO - no previously-included directories found matching '.git*' 19:00:48 INFO - Successfully installed jsonschema functools32 19:00:48 INFO - Cleaning up... 19:00:48 INFO - Return code: 0 19:00:48 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 19:00:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 19:00:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:00:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 19:00:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 19:00:48 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fdb76d9ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf958a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x10626d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, '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': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test-pgo', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 19:00:48 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--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', 'flake8'] in /builds/slave/test-pgo/build 19:00:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --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 flake8 19:00:48 INFO - Using env: {'DISPLAY': ':0', 19:00:48 INFO - 'HOME': '/home/cltbld', 19:00:48 INFO - 'LANG': 'en_US.UTF-8', 19:00:48 INFO - 'LANGUAGE': 'en_US:en', 19:00:48 INFO - 'LOGNAME': 'cltbld', 19:00:48 INFO - 'MAIL': '/var/mail/cltbld', 19:00:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:00:48 INFO - 'MOZ_NO_REMOTE': '1', 19:00:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:00:48 INFO - 'NO_EM_RESTART': '1', 19:00:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:00:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:00:48 INFO - 'PWD': '/builds/slave/test-pgo', 19:00:48 INFO - 'SHELL': '/bin/bash', 19:00:48 INFO - 'SHLVL': '1', 19:00:48 INFO - 'TERM': 'linux', 19:00:48 INFO - 'TMOUT': '86400', 19:00:48 INFO - 'USER': 'cltbld', 19:00:48 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:00:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:00:48 INFO - '_': '/tools/buildbot/bin/python'} 19:00:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 19:00:49 INFO - Downloading/unpacking flake8 19:00:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:50 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 19:00:50 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 19:00: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 19:00: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 19:00: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 19:00: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 19:00: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 19:00: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 19:00:51 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 19:00:51 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 19:00:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:51 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 19:00:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 19:00:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 19:00:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 19:00:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 19:00:51 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 19:00:51 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 19:00:51 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 19:00:51 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 19:00:51 INFO - no previously-included directories found matching 'docs/_build' 19:00:51 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 19:00:51 INFO - Running setup.py install for pep8 19:00:51 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 19:00:51 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 19:00:51 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 19:00:51 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 19:00:51 INFO - no previously-included directories found matching 'docs/_build' 19:00:51 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 19:00:51 INFO - Successfully installed flake8 mccabe pyflakes pep8 19:00:51 INFO - Cleaning up... 19:00:51 INFO - Return code: 0 19:00:51 INFO - Running post-action listener: _resource_record_post_action 19:00:51 INFO - Running post-action listener: _start_resource_monitoring 19:00:51 INFO - Starting resource monitoring. 19:00:51 INFO - ##### 19:00:51 INFO - ##### Running install step. 19:00:51 INFO - ##### 19:00:51 INFO - Running pre-action listener: _resource_record_pre_action 19:00:51 INFO - Running main action method: install 19:00:51 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 19:00:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 19:00:52 INFO - Reading from file tmpfile_stdout 19:00:52 INFO - Detecting whether we're running mozinstall >=1.0... 19:00:52 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 19:00:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 19:00:52 INFO - Reading from file tmpfile_stdout 19:00:52 INFO - Output received: 19:00:52 INFO - Usage: mozinstall [options] installer 19:00:52 INFO - Options: 19:00:52 INFO - -h, --help show this help message and exit 19:00:52 INFO - -d DEST, --destination=DEST 19:00:52 INFO - Directory to install application into. [default: 19:00:52 INFO - "/builds/slave/test-pgo"] 19:00:52 INFO - --app=APP Application being installed. [default: firefox] 19:00:52 INFO - mkdir: /builds/slave/test-pgo/build/application 19:00:52 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 19:00:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 19:01:08 INFO - Reading from file tmpfile_stdout 19:01:08 INFO - Output received: 19:01:08 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 19:01:08 INFO - Running post-action listener: _resource_record_post_action 19:01:08 INFO - ##### 19:01:08 INFO - ##### Running run-tests step. 19:01:08 INFO - ##### 19:01:08 INFO - Running pre-action listener: _resource_record_pre_action 19:01:08 INFO - Running main action method: run_tests 19:01:08 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 19:01:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 19:01:08 INFO - Python 2.7.3 19:01:08 INFO - Return code: 0 19:01:08 INFO - grabbing minidump binary from tooltool 19:01:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 19:01:08 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 0x10f1920>, '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 0x10f2820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x10f2cb0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 19:01:08 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test-pgo/build 19:01:08 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test-pgo/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 19:01:08 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 19:01:08 INFO - Return code: 0 19:01:08 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 19:01:08 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 19:01:08 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 19:01:08 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 19:01:08 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 19:01:08 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 19:01:08 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 19:01:09 INFO - Return code: 0 19:01:09 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 19:01:09 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-061 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 19:01:09 INFO - Using env: {'DISPLAY': ':0', 19:01:09 INFO - 'HOME': '/home/cltbld', 19:01:09 INFO - 'LANG': 'en_US.UTF-8', 19:01:09 INFO - 'LANGUAGE': 'en_US:en', 19:01:09 INFO - 'LOGNAME': 'cltbld', 19:01:09 INFO - 'MAIL': '/var/mail/cltbld', 19:01:09 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 19:01:09 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 19:01:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 19:01:09 INFO - 'MOZ_NO_REMOTE': '1', 19:01:09 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 19:01:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 19:01:09 INFO - 'NO_EM_RESTART': '1', 19:01:09 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 19:01:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 19:01:09 INFO - 'PWD': '/builds/slave/test-pgo', 19:01:09 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 19:01:09 INFO - 'SHELL': '/bin/bash', 19:01:09 INFO - 'SHLVL': '1', 19:01:09 INFO - 'TERM': 'linux', 19:01:09 INFO - 'TMOUT': '86400', 19:01:09 INFO - 'USER': 'cltbld', 19:01:09 INFO - 'XDG_SESSION_COOKIE': '516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305', 19:01:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 19:01:09 INFO - '_': '/tools/buildbot/bin/python'} 19:01:09 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-061', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 19:01:09 INFO - mozversion application_buildid: 20160305163006 19:01:09 INFO - mozversion application_changeset: 8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32 19:01:09 INFO - mozversion application_display_name: Nightly 19:01:09 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 19:01:09 INFO - mozversion application_name: Firefox 19:01:09 INFO - mozversion application_remotingname: firefox 19:01:09 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 19:01:09 INFO - mozversion application_vendor: Mozilla 19:01:09 INFO - mozversion application_version: 47.0a1 19:01:09 INFO - mozversion platform_buildid: 20160305163006 19:01:09 INFO - mozversion platform_changeset: 8fd2d0f7ce4939c2119e6168e6203f87dfc8ef32 19:01:09 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 19:01:09 INFO - mozversion platform_version: 47.0a1 19:01:09 INFO - using testdate: 1457233269 19:01:09 INFO - actual date: 1457233269 19:01:09 INFO - starting webserver on 'localhost:50070' 19:01:09 INFO - SUITE-START | Running 2 tests 19:01:09 INFO - TEST-START | dromaeo_css 19:01:09 INFO - operating with platform_type : linux_ 19:01:09 INFO - Initialising browser for dromaeo_css test... 19:01:09 INFO - TEST-INFO | started process 409 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp8xb_w7/profile http://localhost:50070/getInfo.html) 19:01:14 INFO - PROCESS | 409 | __metrics Screen width/height:1600/1200 19:01:14 INFO - PROCESS | 409 | colorDepth:24 19:01:14 INFO - PROCESS | 409 | Browser inner width/height: 1024/697 19:01:14 INFO - PROCESS | 409 | __metrics 19:01:15 INFO - PROCESS | 409 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:01:15 INFO - TEST-INFO | 409: exit 0 19:01:15 INFO - Browser initialized. 19:01:15 INFO - Running cycle 1/1 for dromaeo_css test... 19:01:15 INFO - TEST-INFO | started process 504 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp8xb_w7/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:01:27 INFO - PROCESS | 504 | RSS: Main: 153509888 19:01:27 INFO - PROCESS | 504 | 19:02:19 INFO - PROCESS | 504 | 1457233339164 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 19:04:26 INFO - PROCESS | 504 | Cycle 1(1): loaded http://localhost:50070/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50070/tests/dromaeo/cssquery-ext.html) 19:04:27 INFO - PROCESS | 504 | RSS: Main: 252616704 19:04:27 INFO - PROCESS | 504 | 19:07:30 INFO - PROCESS | 504 | Cycle 1(1): loaded http://localhost:50070/tests/dromaeo/cssquery-ext.html (next: http://localhost:50070/tests/dromaeo/cssquery-jquery.html) 19:07:30 INFO - PROCESS | 504 | RSS: Main: 234795008 19:07:30 INFO - PROCESS | 504 | 19:10:32 INFO - PROCESS | 504 | Cycle 1(1): loaded http://localhost:50070/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50070/tests/dromaeo/cssquery-mootools.html) 19:10:33 INFO - PROCESS | 504 | RSS: Main: 241336320 19:10:33 INFO - PROCESS | 504 | 19:13:35 INFO - PROCESS | 504 | Cycle 1(1): loaded http://localhost:50070/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50070/tests/dromaeo/cssquery-prototype.html) 19:13:35 INFO - PROCESS | 504 | RSS: Main: 218247168 19:13:35 INFO - PROCESS | 504 | 19:16:38 INFO - PROCESS | 504 | Cycle 1(1): loaded http://localhost:50070/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50070/tests/dromaeo/cssquery-yui.html) 19:16:38 INFO - PROCESS | 504 | RSS: Main: 218025984 19:16:38 INFO - PROCESS | 504 | 19:19:41 INFO - PROCESS | 504 | Cycle 1(1): loaded http://localhost:50070/tests/dromaeo/cssquery-yui.html (next: http://localhost:50070/tests/dromaeo/cssquery-dojo.html) 19:19:41 INFO - PROCESS | 504 | RSS: Main: 316149760 19:19:41 INFO - PROCESS | 504 | 19:19:41 INFO - PROCESS | 504 | __start_tp_report 19:19:41 INFO - PROCESS | 504 | _x_x_mozilla_page_load 19:19:41 INFO - PROCESS | 504 | _x_x_mozilla_page_load_details 19:19:41 INFO - PROCESS | 504 | |i|pagename|runs| 19:19:41 INFO - PROCESS | 504 | |0;dojo.html;3067.8159310441374;3092.3042315479006;3137.701918317759;3153.4639111351066;3172.984135079325;5121.846344609658;5123.7694303756325;5155.948440515594;5163.27714120023;5165.690058596482;5027.497250274971;5067.923981140277;5186.948130518694;5191.299174611427;5237.607179461536;4628.190066738324;4636.768161591924;4646.999999999992;4726.763661816913;4837.153498137812;4727.7163370197895;4754.072955773626;4787.49731278216;4802.183628783097;4841.951580484203;4682.859514214579;4746.596539294164;4754.572088512016;4794.640401969867;4805.975970120162;4689.179393606105;4692.36653051837;4699.24812030077;4708.317293992386;4740.6681532292405;4615.353850460938;4681.625469962395;4687.718736875799;4689.906201875978;4726.503717109688;5007.5993920486635;5052.267421223939;5066.949330506684;5079.847604571869;5103.540681338697;5505.614606977513;5512;5515.972420137914;5516.724163791834;5525.419830917736;5428.782848686048;5464.480874316933;5552.77788888444;5556.138798486241;5557.249771280906;5194.974025129888;5212.635115541913;5218.269442278084;5227.921581176285;5263.499967503081;5657.4908258256955;5657.632253903483;5661.745221465044;5663.377028526858;5664.150377443417;5340.49265319794;5368.543673787772;5393.352797664305;5462.5083742462575;5463.262459567987;5541.33503979517;5551.555875529948;5555.694436805934;5560.972195138998;5590.273264475673;5514.5864060195645;5521.779128834802;5527.806526771544;5530.5022547970875;5531.087370583889;5403.378611459732;5491.2312276281355;5561.6663000220115;5576.470235327637;5591.9720401397735;4207.705460617789;4212.115455754265;4215.3044747616295;4216;4251;3788.9431658525145;3798.848046078126;3813.542374915028;3821.044738815296;3832.846686132579;5160.406553246425;5177.094008548489;5189.766460509286;5241.554467870274;5250.579953603779;5522.337319521603;5526.613137080366;5535.197396377503;5540.556755459554;5548.611597188239;5195.376554813447;5206.3752349717515;5207.557357624569;5212.50481204285;5252.422233554306;4598.701084429501;4636.327732478771;4651.209294419889;4680.180968330596;4695.272232803921;5806.1581070744505;5806.419358064244;5815.505682016991;5817.650940943557;5823.854403639858;5428;5517.5585953124455;5525.143602741581;5531.529819965187;5578.972105139611;5783.94216057834;5803.158542011469;5825.737841797045;5855.882882342415;5869.647821130746;5450.700211488406;5453.890922181614;5457.345118585795;5457.945420545744;5463.836084917459;5451.236826844166;5522.475364840334;5545.473180047889;5545.639533430314;5550.90405278786;5376.489233522809;5415.864603384947;5415.945840541544;5417.052015897123;5472.890542189213;5391.757370918396;5414.7021913795115;5417.6478528895495;5418.485243901823;5464.699441530754;5243.370795504564;5297.576193904555;5342.0384330820825;5349.786008559614;5379.65032272901;5414.891702166014;5448.5368743655645;5452.645578037414;5454.972725136349;5458.754356054066;5353.2773075634295;5353.437889021597;5354.759035843318;5356.973215133899;5395.190721391823 19:19:41 INFO - PROCESS | 504 | |1;ext.html;464.3406362964592;498.7556097512218;517.3352242368557;539.9541039011684;543.9918401223981;28886.411247381384;37579.43630845539;38003.23993520128;38037;38053.04867378314;40679.38980915289;41256.17487650245;41273.793631031804;41277.793611031906;41281.793591032;7504.512206706547;8525.957370213157;8730.25792807609;9960.501974901263;10095.242856785733;10141.695749127539;10269.435181065039;10277.486125693722;10282.537285822118;10288.897111028906;10177.643782467616;10269.383836969768;10303.948480257588;10308;10308.433036183007;10133.189344852432;10192.847107293397;10201;10219.744506387287;10228.33515821473;10028.247881408923;10176.033276838763;10179.745506362326;10503.632372866912;10514.158867290598;40503.59496405028;40799.388009179886;40911.38632920509;40918.38622420666;40919.1816163675;3314.353701028276;3377.3751855906735;3447.0865220716532;3844.3464611016193;4117.258893399187;30342.696573034427;31506.36987260242;31507.684923150933;31567.842160789278;31612.209694757585;3754.5682246541724;3841.481400010991;3925.21495700861;3979.781112038837;4020.296448121567;280678;281781;282265;282520;282771;61805;61851.690741546;62139.37860621426;62141.378586213556;62143.68928155421;65391.34608653853;65649;65656.34343656598;65739.34260657428;65786;16455.42406015784;16597.502074937773;16698.165091745606;16718.164091795363;16720.581985450463;12536.05979551519;12562.057845661611;12594.937025314815;12600.873991260154;12601.243925364324;17096.676995309415;20685;20882.895585521976;20892.268770592957;20948.266810661553;6126.877462450726;7357.190709022003;7464.477486575996;7554.206808285161;7601.467897247139;875.5640749171364;915.4461550761827;957.3346524165638;965.4689920543673;1047.4919663962971;26117.347066323113;27333.589996150073;27879.581806272923;28031.159065228076;28140.296492587848;1059.613241166984;1067.1569460126568;1073.436445865911;1074.5486895503907;1172.6247600767842;14158.221297828512;14473.131612103307;14722.337494812546;14769.556913292618;15472.458463953933;303626;307746;309800;311269;311450;54722.726386367816;54961;54980;55081.72459137759;55107.17339239915;1270.0791925853682;1329.3884812985941;1354.1265883505282;1359.7688392973218;1398.1121987537986;25179.49641007206;26526.143169977917;28599.571006435337;28630.71369286364;28955.42089158247;38263.42604860985;38370.616293836705;38656.80671596624;38673.22653546857;38691.613083868804;211026;212636;213398;213482;213624;26897.596536051584;31490.433887086703;31760.364792703553;31773.20566985844;31845.20386990344;38057.61942380541;38761.6123838758;38769.418458722575;38859;39553.604463954995;32533.62323032353;32665.836670816494;33024.834875825465;34951.65048349484;35723.28553428865;32459.837700811346;34449.65550344565;35159.82420087883;35461.46807797834;35626.28747425089;33474.66525334716;33741.32517349689;33812.830935845166;34187.48718769171;34399.48400774041;30630.846845765627;31343.641615607732;31344.373112538076;31485.52771708472;31519.447310573738;23736;24277;24282.271531854072;24709.135180268604;24835.50328993374 19:19:41 INFO - PROCESS | 504 | |2;jquery.html;346.1294843468675;354.7233158136654;355.5200479352873;357.4977157094282;363.36774013217;16418.34326626935;16474.09392483413;17280.48158555242;17406.651866962653;17414.82585174151;16074.678506429893;17006.149692515388;17597.7360339595;17613.91193044036;17626.383076592323;4827.879303017417;5345.946540534604;5631.831045068655;5636.859078523049;5644.57665675074;5511.063119269734;5582.553395728332;5590.385057643656;5596.832095037135;5601.719914004304;5326.520613144816;5469.288992430978;5471.23402723617;5479.6164268501025;5576.247206627094;5474.09677403228;5490.313710786152;5507.642003269774;5527.2538207342295;5544.085225937735;4910.1898186799135;4937.728424936627;4941.258811178316;5095.821646242401;5153.613478989053;13384.130031547918;13469.124506907117;13628.65928351799;16144.677106457922;20848.791512084837;2079.07481170879;2091.7071609974614;2196.8022877940903;2426.4540478392396;2852.4009957908866;9575.521223938775;9674.806503869953;9807.26445516589;9910.504474776233;9990.80018399628;1836.9908150459296;1885.170524969023;1906.65680177568;1951.1414977409895;1952.9511762205916;47718.761406193094;49391.25913111306;57850.49759309622;59325.7033714833;63875;10278.486075696186;10293.279470436997;10349.793004140025;10377.688669339781;10587.57649694019;12474.563390281297;13440.798388024188;13902.582922512342;13913.513027044004;13978.161310321413;7546.434017448713;7633.503822251536;7784.143744188134;7821.5698136601895;7960.920390796134;7694.384449244047;7717.536947783151;7728.574928378993;7848.450608457353;7848.7252946147755;4582.381378513925;4610.976945115253;4611.33135695329;4629.1436084324505;4672.813087476463;1833.6705888231193;1869.9439016829517;1870.803565625617;1871.3637363296546;1871.6537440573538;853.7566793463833;901.9413738107002;906.0893801729352;913.2100732866156;985.265976847239;15974.361025558848;16429.698274578903;16864.325426982785;16960.727945404145;17129.400470983455;916.3356566489242;959.5538074795254;1032.6127702111708;1037.5434808684154;1048.528162326956;9250.444973301623;9303.53482325881;9442.480663563432;9605.37565058269;9663.806723865484;421915;423002;433646;435188;442619;67912;69016;71026;71296.64351678209;71349;1011.2819897872592;1036.5439206749156;1044.587387981743;1050.8896565860628;1059.057438879398;14560.344784484512;14676.55970320892;14996.700065998837;15084.094954302776;15339.156346401054;25633;30791.84604076965;31560;31682.524762128127;31990.84004579962;36702.44946325754;37917.43123853199;39868.800655996536;43452.56547434612;45136.54863451324;7678.808029799076;7783.455158138876;7791.220877912164;7859.135495095421;7913.248241417056;10481.842772358574;11266.04238639692;11273.549058037586;11502.712432189262;11797.52809887595;10265.692029239135;10616.469176541297;10745.623903163665;10851.728706782395;11063.059639930696;10556.736081598021;10796.298240614335;10858.294210876267;10941.398223097805;10952.561897524329;10702.411367374869;10853.674389768319;10914.945425272823;11087.390193539433;11423.771524569296;7788.337991270805;7857.895678803739;7860.528368297921;7968.282854543119;8107.1892810718455;10441.843372349573;11163;11207.887921121011;11212.103031757277;11332.6033588824 19:19:41 INFO - PROCESS | 504 | |3;mootools.html;1391.6451304917246;1503.894727369084;1506.0286115455528;1687.9746803797946;1838.4392760208132;7118.537295075823;7476.252374762528;7625.428092893041;7674.50115742477;7682;7754.961225193881;7924.92075079249;8009.4793838400465;8013.358931285483;8022.598870056503;2003.058562475634;2244.3603572981624;2285.337252196861;2311.133325003124;2317.9420514487188;2330.976690233093;2337.602607556711;2339.578875802363;2340.941476463085;2342.004648024583;2230.4981379189635;2327.767223277676;2328.8020518255967;2330.627099664054;2330.8718020508863;2285.3715228312262;2326.0230703104653;2344.8358614896965;2345.6598793175067;2345.9648105278347;2283.337832028726;2291.724993000834;2307.1694190091553;2307.4462129089065;2321.0947730385165;8003.799905002364;8050.074241462248;8053.838923221561;8064.717734879251;8066.7579972600915;4716.292556116576;4862.586680132193;4862.6839255448285;4865.537773911473;4875.024995001014;3121.547375630521;3202.96797032029;3217.7747557670973;3230.1440118368414;3256.4138455078078;1024.6260115058026;1908.9618207635908;1909.2935613822835;1914.4161030885575;1917.3481016454332;10885.782284354347;10922.945385273102;10936.945315273453;10942;10993.340399576051;3986.481757371523;4107.342825147962;4135.441715368447;4167.541570427251;4219.303814870574;8556.10160933093;8563.785905352415;8655.047944726075;8662.956685216534;8667.263282620921;4216.620504154579;4800.087983283165;4807.495213002584;4815.590674792682;4834.057358815067;4215.473065866767;4288.978555107205;4308.0306930940915;4310.353446982915;4325.113351762881;3376.712979396779;3436.2096717754557;3457.567804024497;3495.8426870790877;3530.541029666127;1059.7880423915249;1062.3307316390778;1066.2323127348297;1067.8184708599556;1085.066842515436;1343.375330471316;1346.340293256317;1376.4356613788298;1379.2345248387041;1397.2524699285834;7569.5079819811535;7767.456278060482;7778.92221077782;7789.260020298176;7790.883136752953;469.4859129253462;481.16037514537356;490.69576862345576;493.1739336611162;495.02974170625976;5750.396208398058;5776.5089967352405;5780.508656764138;5824.039033559416;5828.358880523139;9430.151286384258;10025.047620476043;10100.242481813893;10113.898861011443;10132.848007279898;9827;9893.653722119836;9935.155511781579;9956.153726933291;9996.150327222267;7456.142543607554;7703;7728.574928378881;7741.729039483591;7806.648700808477;7360.263973602597;7385.335319821027;7404.259574042552;7406.814829629302;7427.7771666850085;8364.3726720495;8664.826703466022;8771.868421973548;8775;8794.692185773467;8593.968723753189;8880.467171969702;8914.821703565764;8918.598663060047;8932.46405215689;6302.464290535356;6760.290169532325;6991.161060672548;7220.8916866246;7339.1926888043345;7548;7571.962140189264;7572.8485430292185;7607.88588171189;7609.162992070978;6674.232463266787;6806.115205023315;6808.727650894107;6928.757493487704;6953.374196322356;6867.107276054081;6868.210155832143;6986.336298051677;7083.1854336749875;7087.893681594677;7101.11236095488;7122.715091396493;7171;7263.128424589083;7300.379467745089;6633.867322653424;6655.301193374819;6694.83262918431;6711.697973591297;6712.093867327848;6546.214454265519;6656.30108838565;6686.465082793462;6688.565243259172;6706.262311145868 19:19:41 INFO - PROCESS | 504 | |4;prototype.html;327.147780033014;329.3166679140783;335.95632567766194;336.9376665316915;337.2748590530359;5774.307083150023;5847.532197424206;5849.239598852154;5862.149988251701;5873.353931067584;5761.30864296284;5769.249997500319;5770.221020162277;5778;5788.42115788421;4270.295401258789;4330.501992270898;4388.100439409929;4453.064856380164;4466.776661166945;4411.64706823455;4431.578999994996;4442;4453.821847126127;4466.910661786762;4271.765052922104;4404.889877753066;4422.270325396322;4422.7788610569505;4429.623482004034;4329.415528903589;4348.152110338469;4357.629601483878;4417.668674849399;4419.955800441987;3896.201278737852;3913.7064720146104;3914.7846868422225;3926.666233370167;3928.626780455852;5518.33779946405;5549.72251387429;5558;5572.58205634575;5577.581681373913;5194.92207616886;5199.818006369759;5218.008578370098;5223.138182199932;5223.660462069991;6171.567990240685;6202.906956395657;6233.96883015582;6234.1583886175695;6234.812955611294;4092.6112019358116;4204.5375008749015;4207.621314081717;4220.345846393814;4372.584604462571;6384.776532821329;6436.967815160941;6446.290908000116;6450.387213214737;6452.612843229421;4374.256376416017;4376.715513491613;4377.759223242689;4379.4525684289465;4381.277089280296;4435.622972047412;4436.822527098944;4438.312061630452;4441.644668426518;4441.822327106879;5134.691918484828;5140.126178549655;5140.563052140536;5149.845504634867;5152.3044389007755;6076.787312444043;6203.906941395882;6231.470325022424;6236.407541283571;6236.968815155895;1530.8545688159606;1548.79865617469;1558.5558115936904;1560.6332511859705;1562.3203906300796;964.1226483899618;1008.969730908074;1013.3717095400751;1022.6807418430142;1039.8076355874186;5842.152887831241;5994.280686317583;5996.790112346047;6003.609765365237;6015.639061656315;6447.516436267299;6448.065030570541;6450.451711604566;6453.386928241809;6453.580517266457;5964.552658550626;5982.940170598238;5985.132155837467;6040.788572399945;6050.515958723292;3427.2974040321674;3462.8787992420143;3466.930661386758;3467.427874400746;3474.583050034012;6595.967020164964;6786;6793.116894803644;6803.217629972616;6833.5216534843075;6565.441937435371;6591.209054913441;6597.1423714916755;6606.6036037837885;6620.8344791380605;6771.153605799275;6774.593524388552;6782.864342713118;6796.35434633709;6804.65976701163;6414.262359828679;6428.485721142204;6431.389018043278;6434.195725534309;6452.741890324334;6174.783882564088;6332.113504109337;6381.680915954091;6429.32492088324;6456.644884531208;6750.459963202834;6780.96609516969;6790.796276111724;6807.9319206807295;6814.693338799865;4322.0491491871735;4367.257566213688;4384.188925048876;4386.978065109782;4391.802368893344;6449.935500644933;6458.870822583428;6459.095726598186;6461.19235095613;6467.191601049869;6233.719482623203;6242.344553821965;6251.249850018027;6252.406021427957;6260.280067792262;6054.39456054391;6201.56589038781;6222.875542489215;6248.343923887926;6251.156093927443;6115.816525504242;6134;6136.846578835565;6141.84645383869;6142.600730952474;6210.285817130907;6266.154069200782;6280.623162610258;6307.936920630735;6343.682815859281;5901.557383196192;5954.37479064692;6126.479249263684;6131.356207598138;6137.539684523768 19:19:41 INFO - PROCESS | 504 | |5;yui.html;791.8495485857691;814.4746638418225;815.3355015662235;829.0548774397188;835.6657337065175;13633.65915852103;13939.790903136449;13942.302884855768;13974;13989.720205595882;11762.647120586375;12126.69683257919;12139.817902731465;12175.452104655289;13022.088453808237;820.5856042698429;826.2935190412201;832.1886160993043;832.5129799067553;833.6082041440544;833.3832963606917;834.9248567628912;835.9164083591653;837.3887062444388;839.911809260028;861.444368382393;876.6800117956964;877.903430622631;879.4151888993844;879.4195830751705;852.654674856684;867.3061550759398;868.9826203475958;869.42183448007;869.6651789061225;632.5983000794482;635.8823617630753;644.5005121031191;645.132297060453;645.8030300758267;12525.43635536394;12637.304948227844;12667.36663166838;12691.682707932283;12724.681882952907;11027.338359698444;11338;11408.71478213043;11512.366819824907;11538.250013749164;9861.654842080492;9893;9945;10105;10123.29136960413;3574.4817001534634;3593.838277277529;3599.262151258986;3716.9442458363146;3733.850645974158;45805.08389832185;46317.53682463166;46515.767421163015;46546.53453465456;46574.767126164494;8618.310535157298;8653.783655408664;8792;8891.333150013645;9176.128267814547;16710.331586736636;16742.83257167437;16820;16827.242774075195;16837.747433788503;7506.249375062559;7599.506032107895;7653.11989121247;7722.884156737653;7746.767596972099;4227.217964676544;4336.956630433655;4451.77741112943;4495.842645507391;4558.020025694492;2965.0363631819746;2995.2811325281777;3002.9699703003125;3006.1582756828125;3014.5327474241526;551.4705882352906;555.4251349852883;558.0958846668423;558.4973523828587;566.0010082204911;629.8725281745716;681.3322943515284;691.5263044814218;708.0547469128668;721.2571051816637;8267.751967440987;8344.41589088758;8663.090375510481;8795.340349473687;8893.599788009555;555.4205575033872;673.9224989126216;686.8941004981975;707.3245050976305;708.1643660480682;3872.3223435898603;3944.5660977292473;3954.6638535724787;4036.7577945323374;4237.343211802176;53694;53966;54591;54820.72589637106;55024.44975550193;41486.585134148874;46092.53907460949;46377.30434043492;53107.73446132745;55257.723711381186;44698;45286.09427811425;46466.53533464622;47083.293750593766;47902;7891;8155.388345873965;8191.590420479071;8278.296344810518;8367.832643347221;33169;33191.33617327688;33206.16984575308;33468.832655836566;34030;40278.597214028654;41350.1729965405;41840;42467.1506569873;42793.358099627905;11362.772744544898;11545.595904143314;11673.12451566119;11825.881741182822;11837.526498940291;12540.498380064695;12592.370381480707;12647.304398258184;12709.93645031769;13018.609441716764;11394;11742.295462272292;12025.158238923192;12481.750364992831;12730.490780368682;11922.463489143183;11972.820407693718;12293;12509.311987840756;12589.559365422167;11648;12152.75694486123;12332.383380830743;12401.689957751129;12445.62663120108;9809.117179453884;9988.550515226978;10010.799784004425;10016;10178.898211017795;8974.775630609025;9540.713778586654;9935.801283974135;9976.2517811163;9987.650432234837 19:19:41 INFO - PROCESS | 504 | __end_tp_report 19:19:41 INFO - PROCESS | 504 | __start_cc_report 19:19:41 INFO - PROCESS | 504 | _x_x_mozilla_cycle_collect,796 19:19:41 INFO - PROCESS | 504 | __end_cc_report 19:19:41 INFO - PROCESS | 504 | __startTimestamp1457234381856__endTimestamp 19:19:41 INFO - PROCESS | 504 | 19:19:41 INFO - PROCESS | 504 | ------- Summary: start ------- 19:19:41 INFO - PROCESS | 504 | Number of tests: 6 19:19:41 INFO - PROCESS | 504 | 19:19:41 INFO - PROCESS | 504 | [#0] dojo.html Cycles:165 Average:5144.56 Median:5354.76 stddev:572.44 (10.7%) stddev-sans-first:550.53 19:19:41 INFO - PROCESS | 504 | Values: 3067.8 3092.3 3137.7 3153.5 3173.0 5121.8 5123.8 5155.9 5163.3 5165.7 5027.5 5067.9 5186.9 5191.3 5237.6 4628.2 4636.8 4647.0 4726.8 4837.2 4727.7 4754.1 4787.5 4802.2 4842.0 4682.9 4746.6 4754.6 4794.6 4806.0 4689.2 4692.4 4699.2 4708.3 4740.7 4615.4 4681.6 4687.7 4689.9 4726.5 5007.6 5052.3 5066.9 5079.8 5103.5 5505.6 5512.0 5516.0 5516.7 5525.4 5428.8 5464.5 5552.8 5556.1 5557.2 5195.0 5212.6 5218.3 5227.9 5263.5 5657.5 5657.6 5661.7 5663.4 5664.2 5340.5 5368.5 5393.4 5462.5 5463.3 5541.3 5551.6 5555.7 5561.0 5590.3 5514.6 5521.8 5527.8 5530.5 5531.1 5403.4 5491.2 5561.7 5576.5 5592.0 4207.7 4212.1 4215.3 4216.0 4251.0 3788.9 3798.8 3813.5 3821.0 3832.8 5160.4 5177.1 5189.8 5241.6 5250.6 5522.3 5526.6 5535.2 5540.6 5548.6 5195.4 5206.4 5207.6 5212.5 5252.4 4598.7 4636.3 4651.2 4680.2 4695.3 5806.2 5806.4 5815.5 5817.7 5823.9 5428.0 5517.6 5525.1 5531.5 5579.0 5783.9 5803.2 5825.7 5855.9 5869.6 5450.7 5453.9 5457.3 5457.9 5463.8 5451.2 5522.5 5545.5 5545.6 5550.9 5376.5 5415.9 5415.9 5417.1 5472.9 5391.8 5414.7 5417.6 5418.5 5464.7 5243.4 5297.6 5342.0 5349.8 5379.7 5414.9 5448.5 5452.6 5455.0 5458.8 5353.3 5353.4 5354.8 5357.0 5395.2 19:19:41 INFO - PROCESS | 504 | 19:19:41 INFO - PROCESS | 504 | [#1] ext.html Cycles:180 Average:44150.08 Median:31507.03 stddev:70712.50 (224.4%) stddev-sans-first:70834.79 19:19:41 INFO - PROCESS | 504 | Values: 464.3 498.8 517.3 540.0 544.0 28886.4 37579.4 38003.2 38037.0 38053.0 40679.4 41256.2 41273.8 41277.8 41281.8 7504.5 8526.0 8730.3 9960.5 10095.2 10141.7 10269.4 10277.5 10282.5 10288.9 10177.6 10269.4 10303.9 10308.0 10308.4 10133.2 10192.8 10201.0 10219.7 10228.3 10028.2 10176.0 10179.7 10503.6 10514.2 40503.6 40799.4 40911.4 40918.4 40919.2 3314.4 3377.4 3447.1 3844.3 4117.3 30342.7 31506.4 31507.7 31567.8 31612.2 3754.6 3841.5 3925.2 3979.8 4020.3 280678.0 281781.0 282265.0 282520.0 282771.0 61805.0 61851.7 62139.4 62141.4 62143.7 65391.3 65649.0 65656.3 65739.3 65786.0 16455.4 16597.5 16698.2 16718.2 16720.6 12536.1 12562.1 12594.9 12600.9 12601.2 17096.7 20685.0 20882.9 20892.3 20948.3 6126.9 7357.2 7464.5 7554.2 7601.5 875.6 915.4 957.3 965.5 1047.5 26117.3 27333.6 27879.6 28031.2 28140.3 1059.6 1067.2 1073.4 1074.5 1172.6 14158.2 14473.1 14722.3 14769.6 15472.5 303626.0 307746.0 309800.0 311269.0 311450.0 54722.7 54961.0 54980.0 55081.7 55107.2 1270.1 1329.4 1354.1 1359.8 1398.1 25179.5 26526.1 28599.6 28630.7 28955.4 38263.4 38370.6 38656.8 38673.2 38691.6 211026.0 212636.0 213398.0 213482.0 213624.0 26897.6 31490.4 31760.4 31773.2 31845.2 38057.6 38761.6 38769.4 38859.0 39553.6 32533.6 32665.8 33024.8 34951.7 35723.3 32459.8 34449.7 35159.8 35461.5 35626.3 33474.7 33741.3 33812.8 34187.5 34399.5 30630.8 31343.6 31344.4 31485.5 31519.4 23736.0 24277.0 24282.3 24709.1 24835.5 19:19:41 INFO - PROCESS | 504 | 19:19:41 INFO - PROCESS | 504 | [#2] jquery.html Cycles:180 Average:24431.14 Median:356.51 stddev:70522.42 (19781.4%) stddev-sans-first:70697.06 19:19:41 INFO - PROCESS | 504 | Values: 346.1 354.7 355.5 357.5 363.4 16418.3 16474.1 17280.5 17406.7 17414.8 16074.7 17006.1 17597.7 17613.9 17626.4 4827.9 5345.9 5631.8 5636.9 5644.6 5511.1 5582.6 5590.4 5596.8 5601.7 5326.5 5469.3 5471.2 5479.6 5576.2 5474.1 5490.3 5507.6 5527.3 5544.1 4910.2 4937.7 4941.3 5095.8 5153.6 13384.1 13469.1 13628.7 16144.7 20848.8 2079.1 2091.7 2196.8 2426.5 2852.4 9575.5 9674.8 9807.3 9910.5 9990.8 1837.0 1885.2 1906.7 1951.1 1953.0 47718.8 49391.3 57850.5 59325.7 63875.0 10278.5 10293.3 10349.8 10377.7 10587.6 12474.6 13440.8 13902.6 13913.5 13978.2 7546.4 7633.5 7784.1 7821.6 7960.9 7694.4 7717.5 7728.6 7848.5 7848.7 4582.4 4611.0 4611.3 4629.1 4672.8 1833.7 1869.9 1870.8 1871.4 1871.7 853.8 901.9 906.1 913.2 985.3 15974.4 16429.7 16864.3 16960.7 17129.4 916.3 959.6 1032.6 1037.5 1048.5 9250.4 9303.5 9442.5 9605.4 9663.8 421915.0 423002.0 433646.0 435188.0 442619.0 67912.0 69016.0 71026.0 71296.6 71349.0 1011.3 1036.5 1044.6 1050.9 1059.1 14560.3 14676.6 14996.7 15084.1 15339.2 25633.0 30791.8 31560.0 31682.5 31990.8 36702.4 37917.4 39868.8 43452.6 45136.5 7678.8 7783.5 7791.2 7859.1 7913.2 10481.8 11266.0 11273.5 11502.7 11797.5 10265.7 10616.5 10745.6 10851.7 11063.1 10556.7 10796.3 10858.3 10941.4 10952.6 10702.4 10853.7 10914.9 11087.4 11423.8 7788.3 7857.9 7860.5 7968.3 8107.2 10441.8 11163.0 11207.9 11212.1 11332.6 19:19:41 INFO - PROCESS | 504 | 19:19:41 INFO - PROCESS | 504 | [#3] mootools.html Cycles:180 Average:5563.80 Median:5778.51 stddev:2908.16 (50.3%) stddev-sans-first:2899.41 19:19:41 INFO - PROCESS | 504 | Values: 1391.6 1503.9 1506.0 1688.0 1838.4 7118.5 7476.3 7625.4 7674.5 7682.0 7755.0 7924.9 8009.5 8013.4 8022.6 2003.1 2244.4 2285.3 2311.1 2317.9 2331.0 2337.6 2339.6 2340.9 2342.0 2230.5 2327.8 2328.8 2330.6 2330.9 2285.4 2326.0 2344.8 2345.7 2346.0 2283.3 2291.7 2307.2 2307.4 2321.1 8003.8 8050.1 8053.8 8064.7 8066.8 4716.3 4862.6 4862.7 4865.5 4875.0 3121.5 3203.0 3217.8 3230.1 3256.4 1024.6 1909.0 1909.3 1914.4 1917.3 10885.8 10922.9 10936.9 10942.0 10993.3 3986.5 4107.3 4135.4 4167.5 4219.3 8556.1 8563.8 8655.0 8663.0 8667.3 4216.6 4800.1 4807.5 4815.6 4834.1 4215.5 4289.0 4308.0 4310.4 4325.1 3376.7 3436.2 3457.6 3495.8 3530.5 1059.8 1062.3 1066.2 1067.8 1085.1 1343.4 1346.3 1376.4 1379.2 1397.3 7569.5 7767.5 7778.9 7789.3 7790.9 469.5 481.2 490.7 493.2 495.0 5750.4 5776.5 5780.5 5824.0 5828.4 9430.2 10025.0 10100.2 10113.9 10132.8 9827.0 9893.7 9935.2 9956.2 9996.2 7456.1 7703.0 7728.6 7741.7 7806.6 7360.3 7385.3 7404.3 7406.8 7427.8 8364.4 8664.8 8771.9 8775.0 8794.7 8594.0 8880.5 8914.8 8918.6 8932.5 6302.5 6760.3 6991.2 7220.9 7339.2 7548.0 7572.0 7572.8 7607.9 7609.2 6674.2 6806.1 6808.7 6928.8 6953.4 6867.1 6868.2 6986.3 7083.2 7087.9 7101.1 7122.7 7171.0 7263.1 7300.4 6633.9 6655.3 6694.8 6711.7 6712.1 6546.2 6656.3 6686.5 6688.6 6706.3 19:19:41 INFO - PROCESS | 504 | 19:19:41 INFO - PROCESS | 504 | [#4] prototype.html Cycles:180 Average:5198.71 Median:5927.97 stddev:1591.96 (26.9%) stddev-sans-first:1553.86 19:19:41 INFO - PROCESS | 504 | Values: 327.1 329.3 336.0 336.9 337.3 5774.3 5847.5 5849.2 5862.1 5873.4 5761.3 5769.2 5770.2 5778.0 5788.4 4270.3 4330.5 4388.1 4453.1 4466.8 4411.6 4431.6 4442.0 4453.8 4466.9 4271.8 4404.9 4422.3 4422.8 4429.6 4329.4 4348.2 4357.6 4417.7 4420.0 3896.2 3913.7 3914.8 3926.7 3928.6 5518.3 5549.7 5558.0 5572.6 5577.6 5194.9 5199.8 5218.0 5223.1 5223.7 6171.6 6202.9 6234.0 6234.2 6234.8 4092.6 4204.5 4207.6 4220.3 4372.6 6384.8 6437.0 6446.3 6450.4 6452.6 4374.3 4376.7 4377.8 4379.5 4381.3 4435.6 4436.8 4438.3 4441.6 4441.8 5134.7 5140.1 5140.6 5149.8 5152.3 6076.8 6203.9 6231.5 6236.4 6237.0 1530.9 1548.8 1558.6 1560.6 1562.3 964.1 1009.0 1013.4 1022.7 1039.8 5842.2 5994.3 5996.8 6003.6 6015.6 6447.5 6448.1 6450.5 6453.4 6453.6 5964.6 5982.9 5985.1 6040.8 6050.5 3427.3 3462.9 3466.9 3467.4 3474.6 6596.0 6786.0 6793.1 6803.2 6833.5 6565.4 6591.2 6597.1 6606.6 6620.8 6771.2 6774.6 6782.9 6796.4 6804.7 6414.3 6428.5 6431.4 6434.2 6452.7 6174.8 6332.1 6381.7 6429.3 6456.6 6750.5 6781.0 6790.8 6807.9 6814.7 4322.0 4367.3 4384.2 4387.0 4391.8 6449.9 6458.9 6459.1 6461.2 6467.2 6233.7 6242.3 6251.2 6252.4 6260.3 6054.4 6201.6 6222.9 6248.3 6251.2 6115.8 6134.0 6136.8 6141.8 6142.6 6210.3 6266.2 6280.6 6307.9 6343.7 5901.6 5954.4 6126.5 6131.4 6137.5 19:19:41 INFO - PROCESS | 504 | 19:19:41 INFO - PROCESS | 504 | [#5] yui.html Cycles:180 Average:13423.69 Median:46347.42 stddev:15218.79 (32.8%) stddev-sans-first:15231.92 19:19:41 INFO - PROCESS | 504 | Values: 791.8 814.5 815.3 829.1 835.7 13633.7 13939.8 13942.3 13974.0 13989.7 11762.6 12126.7 12139.8 12175.5 13022.1 820.6 826.3 832.2 832.5 833.6 833.4 834.9 835.9 837.4 839.9 861.4 876.7 877.9 879.4 879.4 852.7 867.3 869.0 869.4 869.7 632.6 635.9 644.5 645.1 645.8 12525.4 12637.3 12667.4 12691.7 12724.7 11027.3 11338.0 11408.7 11512.4 11538.3 9861.7 9893.0 9945.0 10105.0 10123.3 3574.5 3593.8 3599.3 3716.9 3733.9 45805.1 46317.5 46515.8 46546.5 46574.8 8618.3 8653.8 8792.0 8891.3 9176.1 16710.3 16742.8 16820.0 16827.2 16837.7 7506.2 7599.5 7653.1 7722.9 7746.8 4227.2 4337.0 4451.8 4495.8 4558.0 2965.0 2995.3 3003.0 3006.2 3014.5 551.5 555.4 558.1 558.5 566.0 629.9 681.3 691.5 708.1 721.3 8267.8 8344.4 8663.1 8795.3 8893.6 555.4 673.9 686.9 707.3 708.2 3872.3 3944.6 3954.7 4036.8 4237.3 53694.0 53966.0 54591.0 54820.7 55024.4 41486.6 46092.5 46377.3 53107.7 55257.7 44698.0 45286.1 46466.5 47083.3 47902.0 7891.0 8155.4 8191.6 8278.3 8367.8 33169.0 33191.3 33206.2 33468.8 34030.0 40278.6 41350.2 41840.0 42467.2 42793.4 11362.8 11545.6 11673.1 11825.9 11837.5 12540.5 12592.4 12647.3 12709.9 13018.6 11394.0 11742.3 12025.2 12481.8 12730.5 11922.5 11972.8 12293.0 12509.3 12589.6 11648.0 12152.8 12332.4 12401.7 12445.6 9809.1 9988.6 10010.8 10016.0 10178.9 8974.8 9540.7 9935.8 9976.3 9987.7 19:19:41 INFO - PROCESS | 504 | -------- Summary: end -------- 19:19:41 INFO - PROCESS | 504 | 19:19:42 INFO - TEST-INFO | 504: exit 0 19:19:42 INFO - TEST-OK | dromaeo_css | took 1113105ms 19:19:42 INFO - TEST-START | kraken 19:19:42 INFO - operating with platform_type : linux_ 19:19:42 INFO - Initialising browser for kraken test... 19:19:42 INFO - TEST-INFO | started process 697 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp67XGQ1/profile http://localhost:50070/getInfo.html) 19:19:47 INFO - PROCESS | 697 | __metrics Screen width/height:1600/1200 19:19:47 INFO - PROCESS | 697 | colorDepth:24 19:19:47 INFO - PROCESS | 697 | Browser inner width/height: 1024/697 19:19:47 INFO - PROCESS | 697 | __metrics 19:19:47 INFO - PROCESS | 697 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 19:19:48 INFO - PROCESS | 697 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 19:19:48 INFO - TEST-INFO | 697: exit 0 19:19:48 INFO - Browser initialized. 19:19:48 INFO - Running cycle 1/1 for kraken test... 19:19:48 INFO - TEST-INFO | started process 783 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp67XGQ1/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 19:20:00 INFO - PROCESS | 783 | RSS: Main: 154402816 19:20:00 INFO - PROCESS | 783 | 19:20:03 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50070/tests/kraken/driver.html?testName=audio-beat-detection) 19:20:03 INFO - PROCESS | 783 | RSS: Main: 197128192 19:20:03 INFO - PROCESS | 783 | 19:20:06 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50070/tests/kraken/driver.html?testName=audio-dft) 19:20:06 INFO - PROCESS | 783 | RSS: Main: 188022784 19:20:06 INFO - PROCESS | 783 | 19:20:09 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50070/tests/kraken/driver.html?testName=audio-fft) 19:20:10 INFO - PROCESS | 783 | RSS: Main: 172929024 19:20:10 INFO - PROCESS | 783 | 19:20:12 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50070/tests/kraken/driver.html?testName=audio-oscillator) 19:20:13 INFO - PROCESS | 783 | RSS: Main: 172953600 19:20:13 INFO - PROCESS | 783 | 19:20:15 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50070/tests/kraken/driver.html?testName=imaging-gaussian-blur) 19:20:15 INFO - PROCESS | 783 | RSS: Main: 176582656 19:20:15 INFO - PROCESS | 783 | 19:20:18 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50070/tests/kraken/driver.html?testName=imaging-darkroom) 19:20:19 INFO - PROCESS | 783 | RSS: Main: 176844800 19:20:19 INFO - PROCESS | 783 | 19:20:22 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50070/tests/kraken/driver.html?testName=imaging-desaturate) 19:20:23 INFO - PROCESS | 783 | RSS: Main: 175452160 19:20:23 INFO - PROCESS | 783 | 19:20:26 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50070/tests/kraken/driver.html?testName=json-parse-financial) 19:20:26 INFO - PROCESS | 783 | RSS: Main: 177922048 19:20:26 INFO - PROCESS | 783 | 19:20:28 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50070/tests/kraken/driver.html?testName=json-stringify-tinderbox) 19:20:29 INFO - PROCESS | 783 | RSS: Main: 187166720 19:20:29 INFO - PROCESS | 783 | 19:20:30 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50070/tests/kraken/driver.html?testName=stanford-crypto-aes) 19:20:31 INFO - PROCESS | 783 | RSS: Main: 184516608 19:20:31 INFO - PROCESS | 783 | 19:20:33 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50070/tests/kraken/driver.html?testName=stanford-crypto-ccm) 19:20:34 INFO - PROCESS | 783 | RSS: Main: 195514368 19:20:34 INFO - PROCESS | 783 | 19:20:36 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50070/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 19:20:37 INFO - PROCESS | 783 | RSS: Main: 200130560 19:20:37 INFO - PROCESS | 783 | 19:20:39 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50070/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 19:20:40 INFO - PROCESS | 783 | RSS: Main: 200859648 19:20:40 INFO - PROCESS | 783 | 19:20:41 INFO - PROCESS | 783 | Cycle 1(1): loaded http://localhost:50070/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50070/tests/kraken/driver.html?testName=ai-astar) 19:20:42 INFO - PROCESS | 783 | RSS: Main: 260952064 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | __start_tp_report 19:20:42 INFO - PROCESS | 783 | _x_x_mozilla_page_load 19:20:42 INFO - PROCESS | 783 | _x_x_mozilla_page_load_details 19:20:42 INFO - PROCESS | 783 | |i|pagename|runs| 19:20:42 INFO - PROCESS | 783 | |0;ai-astar;111;113;110;112;111;113;101;111;111;110 19:20:42 INFO - PROCESS | 783 | |1;audio-beat-detection;159;127;150;167;129;160;160;132;172;128 19:20:42 INFO - PROCESS | 783 | |2;audio-dft;161;161;162;159;161;160;162;170;164;164 19:20:42 INFO - PROCESS | 783 | |3;audio-fft;76;76;110;93;73;73;73;113;105;72 19:20:42 INFO - PROCESS | 783 | |4;audio-oscillator;94;94;136;94;93;94;149;94;94;134 19:20:42 INFO - PROCESS | 783 | |5;imaging-gaussian-blur;117;117;117;117;118;118;118;117;116;117 19:20:42 INFO - PROCESS | 783 | |6;imaging-darkroom;145;146;145;147;147;148;146;145;145;147 19:20:42 INFO - PROCESS | 783 | |7;imaging-desaturate;96;97;95;96;97;96;96;96;96;96 19:20:42 INFO - PROCESS | 783 | |8;json-parse-financial;57;57;58;58;58;59;57;66;56;60 19:20:42 INFO - PROCESS | 783 | |9;json-stringify-tinderbox;66;67;67;67;67;68;68;66;67;67 19:20:42 INFO - PROCESS | 783 | |10;stanford-crypto-aes;81;83;83;85;85;82;82;82;82;82 19:20:42 INFO - PROCESS | 783 | |11;stanford-crypto-ccm;115;114;120;113;113;120;113;114;118;118 19:20:42 INFO - PROCESS | 783 | |12;stanford-crypto-pbkdf2;151;143;150;149;148;146;151;148;150;149 19:20:42 INFO - PROCESS | 783 | |13;stanford-crypto-sha256-iterative;69;70;70;70;70;68;67;70;69;67 19:20:42 INFO - PROCESS | 783 | __end_tp_report 19:20:42 INFO - PROCESS | 783 | __start_cc_report 19:20:42 INFO - PROCESS | 783 | _x_x_mozilla_cycle_collect,1086 19:20:42 INFO - PROCESS | 783 | __end_cc_report 19:20:42 INFO - PROCESS | 783 | __startTimestamp1457234442200__endTimestamp 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | ------- Summary: start ------- 19:20:42 INFO - PROCESS | 783 | Number of tests: 14 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#0] ai-astar Cycles:10 Average:110.30 Median:111.00 stddev:3.43 (3.1%) stddev-sans-first:3.63 19:20:42 INFO - PROCESS | 783 | Values: 111.0 113.0 110.0 112.0 111.0 113.0 101.0 111.0 111.0 110.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#1] audio-beat-detection Cycles:10 Average:148.40 Median:159.50 stddev:17.66 (11.1%) stddev-sans-first:18.31 19:20:42 INFO - PROCESS | 783 | Values: 159.0 127.0 150.0 167.0 129.0 160.0 160.0 132.0 172.0 128.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#2] audio-dft Cycles:10 Average:162.40 Median:162.00 stddev:3.10 (1.9%) stddev-sans-first:3.24 19:20:42 INFO - PROCESS | 783 | Values: 161.0 161.0 162.0 159.0 161.0 160.0 162.0 170.0 164.0 164.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#3] audio-fft Cycles:10 Average:86.40 Median:73.00 stddev:17.05 (23.4%) stddev-sans-first:17.66 19:20:42 INFO - PROCESS | 783 | Values: 76.0 76.0 110.0 93.0 73.0 73.0 73.0 113.0 105.0 72.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#4] audio-oscillator Cycles:10 Average:107.60 Median:94.00 stddev:22.46 (23.9%) stddev-sans-first:23.28 19:20:42 INFO - PROCESS | 783 | Values: 94.0 94.0 136.0 94.0 93.0 94.0 149.0 94.0 94.0 134.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#5] imaging-gaussian-blur Cycles:10 Average:117.20 Median:117.00 stddev:0.63 (0.5%) stddev-sans-first:0.67 19:20:42 INFO - PROCESS | 783 | Values: 117.0 117.0 117.0 117.0 118.0 118.0 118.0 117.0 116.0 117.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#6] imaging-darkroom Cycles:10 Average:146.10 Median:146.50 stddev:1.10 (0.8%) stddev-sans-first:1.09 19:20:42 INFO - PROCESS | 783 | Values: 145.0 146.0 145.0 147.0 147.0 148.0 146.0 145.0 145.0 147.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#7] imaging-desaturate Cycles:10 Average:96.10 Median:96.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 19:20:42 INFO - PROCESS | 783 | Values: 96.0 97.0 95.0 96.0 97.0 96.0 96.0 96.0 96.0 96.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#8] json-parse-financial Cycles:10 Average:58.60 Median:58.00 stddev:2.84 (4.9%) stddev-sans-first:2.95 19:20:42 INFO - PROCESS | 783 | Values: 57.0 57.0 58.0 58.0 58.0 59.0 57.0 66.0 56.0 60.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#9] json-stringify-tinderbox Cycles:10 Average:67.00 Median:67.00 stddev:0.67 (1.0%) stddev-sans-first:0.60 19:20:42 INFO - PROCESS | 783 | Values: 66.0 67.0 67.0 67.0 67.0 68.0 68.0 66.0 67.0 67.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#10] stanford-crypto-aes Cycles:10 Average:82.70 Median:82.50 stddev:1.34 (1.6%) stddev-sans-first:1.27 19:20:42 INFO - PROCESS | 783 | Values: 81.0 83.0 83.0 85.0 85.0 82.0 82.0 82.0 82.0 82.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#11] stanford-crypto-ccm Cycles:10 Average:115.80 Median:116.50 stddev:2.90 (2.5%) stddev-sans-first:3.06 19:20:42 INFO - PROCESS | 783 | Values: 115.0 114.0 120.0 113.0 113.0 120.0 113.0 114.0 118.0 118.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:148.50 Median:149.50 stddev:2.46 (1.6%) stddev-sans-first:2.44 19:20:42 INFO - PROCESS | 783 | Values: 151.0 143.0 150.0 149.0 148.0 146.0 151.0 148.0 150.0 149.0 19:20:42 INFO - PROCESS | 783 | 19:20:42 INFO - PROCESS | 783 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.00 Median:70.00 stddev:1.25 (1.8%) stddev-sans-first:1.32 19:20:42 INFO - PROCESS | 783 | Values: 69.0 70.0 70.0 70.0 70.0 68.0 67.0 70.0 69.0 67.0 19:20:42 INFO - PROCESS | 783 | -------- Summary: end -------- 19:20:42 INFO - PROCESS | 783 | 19:20:43 INFO - TEST-INFO | 783: exit 0 19:20:43 INFO - TEST-OK | kraken | took 60550ms 19:20:43 INFO - SUITE-END | took 1173s 19:20:43 INFO - Completed test suite (00:19:33) 19:20:43 INFO - javascript benchmark 19:20:43 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3067.8159310441374, 3092.3042315479006, 3137.701918317759, 3153.4639111351066, 3172.984135079325, 5121.846344609658, 5123.7694303756325, 5155.948440515594, 5163.27714120023, 5165.690058596482, 5027.497250274971, 5067.923981140277, 5186.948130518694, 5191.299174611427, 5237.607179461536, 4628.190066738324, 4636.768161591924, 4646.999999999992, 4726.763661816913, 4837.153498137812, 4727.7163370197895, 4754.072955773626, 4787.49731278216, 4802.183628783097, 4841.951580484203, 4682.859514214579, 4746.596539294164, 4754.572088512016, 4794.640401969867, 4805.975970120162, 4689.179393606105, 4692.36653051837, 4699.24812030077, 4708.317293992386, 4740.6681532292405, 4615.353850460938, 4681.625469962395, 4687.718736875799, 4689.906201875978, 4726.503717109688, 5007.5993920486635, 5052.267421223939, 5066.949330506684, 5079.847604571869, 5103.540681338697, 5505.614606977513, 5512.0, 5515.972420137914, 5516.724163791834, 5525.419830917736, 5428.782848686048, 5464.480874316933, 5552.77788888444, 5556.138798486241, 5557.249771280906, 5194.974025129888, 5212.635115541913, 5218.269442278084, 5227.921581176285, 5263.499967503081, 5657.4908258256955, 5657.632253903483, 5661.745221465044, 5663.377028526858, 5664.150377443417, 5340.49265319794, 5368.543673787772, 5393.352797664305, 5462.5083742462575, 5463.262459567987, 5541.33503979517, 5551.555875529948, 5555.694436805934, 5560.972195138998, 5590.273264475673, 5514.5864060195645, 5521.779128834802, 5527.806526771544, 5530.5022547970875, 5531.087370583889, 5403.378611459732, 5491.2312276281355, 5561.6663000220115, 5576.470235327637, 5591.9720401397735, 4207.705460617789, 4212.115455754265, 4215.3044747616295, 4216.0, 4251.0, 3788.9431658525145, 3798.848046078126, 3813.542374915028, 3821.044738815296, 3832.846686132579, 5160.406553246425, 5177.094008548489, 5189.766460509286, 5241.554467870274, 5250.579953603779, 5522.337319521603, 5526.613137080366, 5535.197396377503, 5540.556755459554, 5548.611597188239, 5195.376554813447, 5206.3752349717515, 5207.557357624569, 5212.50481204285, 5252.422233554306, 4598.701084429501, 4636.327732478771, 4651.209294419889, 4680.180968330596, 4695.272232803921, 5806.1581070744505, 5806.419358064244, 5815.505682016991, 5817.650940943557, 5823.854403639858, 5428.0, 5517.5585953124455, 5525.143602741581, 5531.529819965187, 5578.972105139611, 5783.94216057834, 5803.158542011469, 5825.737841797045, 5855.882882342415, 5869.647821130746, 5450.700211488406, 5453.890922181614, 5457.345118585795, 5457.945420545744, 5463.836084917459, 5451.236826844166, 5522.475364840334, 5545.473180047889, 5545.639533430314, 5550.90405278786, 5376.489233522809, 5415.864603384947, 5415.945840541544, 5417.052015897123, 5472.890542189213, 5391.757370918396, 5414.7021913795115, 5417.6478528895495, 5418.485243901823, 5464.699441530754, 5243.370795504564, 5297.576193904555, 5342.0384330820825, 5349.786008559614, 5379.65032272901, 5414.891702166014, 5448.5368743655645, 5452.645578037414, 5454.972725136349, 5458.754356054066, 5353.2773075634295, 5353.437889021597, 5354.759035843318, 5356.973215133899, 5395.190721391823], "unit": "score", "name": "dojo.html", "value": 5107.468397532418}, {"lowerIsBetter": false, "replicates": [464.3406362964592, 498.7556097512218, 517.3352242368557, 539.9541039011684, 543.9918401223981, 28886.411247381384, 37579.43630845539, 38003.23993520128, 38037.0, 38053.04867378314, 40679.38980915289, 41256.17487650245, 41273.793631031804, 41277.793611031906, 41281.793591032, 7504.512206706547, 8525.957370213157, 8730.25792807609, 9960.501974901263, 10095.242856785733, 10141.695749127539, 10269.435181065039, 10277.486125693722, 10282.537285822118, 10288.897111028906, 10177.643782467616, 10269.383836969768, 10303.948480257588, 10308.0, 10308.433036183007, 10133.189344852432, 10192.847107293397, 10201.0, 10219.744506387287, 10228.33515821473, 10028.247881408923, 10176.033276838763, 10179.745506362326, 10503.632372866912, 10514.158867290598, 40503.59496405028, 40799.388009179886, 40911.38632920509, 40918.38622420666, 40919.1816163675, 3314.353701028276, 3377.3751855906735, 3447.0865220716532, 3844.3464611016193, 4117.258893399187, 30342.696573034427, 31506.36987260242, 31507.684923150933, 31567.842160789278, 31612.209694757585, 3754.5682246541724, 3841.481400010991, 3925.21495700861, 3979.781112038837, 4020.296448121567, 280678.0, 281781.0, 282265.0, 282520.0, 282771.0, 61805.0, 61851.690741546, 62139.37860621426, 62141.378586213556, 62143.68928155421, 65391.34608653853, 65649.0, 65656.34343656598, 65739.34260657428, 65786.0, 16455.42406015784, 16597.502074937773, 16698.165091745606, 16718.164091795363, 16720.581985450463, 12536.05979551519, 12562.057845661611, 12594.937025314815, 12600.873991260154, 12601.243925364324, 17096.676995309415, 20685.0, 20882.895585521976, 20892.268770592957, 20948.266810661553, 6126.877462450726, 7357.190709022003, 7464.477486575996, 7554.206808285161, 7601.467897247139, 875.5640749171364, 915.4461550761827, 957.3346524165638, 965.4689920543673, 1047.4919663962971, 26117.347066323113, 27333.589996150073, 27879.581806272923, 28031.159065228076, 28140.296492587848, 1059.613241166984, 1067.1569460126568, 1073.436445865911, 1074.5486895503907, 1172.6247600767842, 14158.221297828512, 14473.131612103307, 14722.337494812546, 14769.556913292618, 15472.458463953933, 303626.0, 307746.0, 309800.0, 311269.0, 311450.0, 54722.726386367816, 54961.0, 54980.0, 55081.72459137759, 55107.17339239915, 1270.0791925853682, 1329.3884812985941, 1354.1265883505282, 1359.7688392973218, 1398.1121987537986, 25179.49641007206, 26526.143169977917, 28599.571006435337, 28630.71369286364, 28955.42089158247, 38263.42604860985, 38370.616293836705, 38656.80671596624, 38673.22653546857, 38691.613083868804, 211026.0, 212636.0, 213398.0, 213482.0, 213624.0, 26897.596536051584, 31490.433887086703, 31760.364792703553, 31773.20566985844, 31845.20386990344, 38057.61942380541, 38761.6123838758, 38769.418458722575, 38859.0, 39553.604463954995, 32533.62323032353, 32665.836670816494, 33024.834875825465, 34951.65048349484, 35723.28553428865, 32459.837700811346, 34449.65550344565, 35159.82420087883, 35461.46807797834, 35626.28747425089, 33474.66525334716, 33741.32517349689, 33812.830935845166, 34187.48718769171, 34399.48400774041, 30630.846845765627, 31343.641615607732, 31344.373112538076, 31485.52771708472, 31519.447310573738, 23736.0, 24277.0, 24282.271531854072, 24709.135180268604, 24835.50328993374], "unit": "score", "name": "ext.html", "value": 18444.397244433152}, {"lowerIsBetter": false, "replicates": [346.1294843468675, 354.7233158136654, 355.5200479352873, 357.4977157094282, 363.36774013217, 16418.34326626935, 16474.09392483413, 17280.48158555242, 17406.651866962653, 17414.82585174151, 16074.678506429893, 17006.149692515388, 17597.7360339595, 17613.91193044036, 17626.383076592323, 4827.879303017417, 5345.946540534604, 5631.831045068655, 5636.859078523049, 5644.57665675074, 5511.063119269734, 5582.553395728332, 5590.385057643656, 5596.832095037135, 5601.719914004304, 5326.520613144816, 5469.288992430978, 5471.23402723617, 5479.6164268501025, 5576.247206627094, 5474.09677403228, 5490.313710786152, 5507.642003269774, 5527.2538207342295, 5544.085225937735, 4910.1898186799135, 4937.728424936627, 4941.258811178316, 5095.821646242401, 5153.613478989053, 13384.130031547918, 13469.124506907117, 13628.65928351799, 16144.677106457922, 20848.791512084837, 2079.07481170879, 2091.7071609974614, 2196.8022877940903, 2426.4540478392396, 2852.4009957908866, 9575.521223938775, 9674.806503869953, 9807.26445516589, 9910.504474776233, 9990.80018399628, 1836.9908150459296, 1885.170524969023, 1906.65680177568, 1951.1414977409895, 1952.9511762205916, 47718.761406193094, 49391.25913111306, 57850.49759309622, 59325.7033714833, 63875.0, 10278.486075696186, 10293.279470436997, 10349.793004140025, 10377.688669339781, 10587.57649694019, 12474.563390281297, 13440.798388024188, 13902.582922512342, 13913.513027044004, 13978.161310321413, 7546.434017448713, 7633.503822251536, 7784.143744188134, 7821.5698136601895, 7960.920390796134, 7694.384449244047, 7717.536947783151, 7728.574928378993, 7848.450608457353, 7848.7252946147755, 4582.381378513925, 4610.976945115253, 4611.33135695329, 4629.1436084324505, 4672.813087476463, 1833.6705888231193, 1869.9439016829517, 1870.803565625617, 1871.3637363296546, 1871.6537440573538, 853.7566793463833, 901.9413738107002, 906.0893801729352, 913.2100732866156, 985.265976847239, 15974.361025558848, 16429.698274578903, 16864.325426982785, 16960.727945404145, 17129.400470983455, 916.3356566489242, 959.5538074795254, 1032.6127702111708, 1037.5434808684154, 1048.528162326956, 9250.444973301623, 9303.53482325881, 9442.480663563432, 9605.37565058269, 9663.806723865484, 421915.0, 423002.0, 433646.0, 435188.0, 442619.0, 67912.0, 69016.0, 71026.0, 71296.64351678209, 71349.0, 1011.2819897872592, 1036.5439206749156, 1044.587387981743, 1050.8896565860628, 1059.057438879398, 14560.344784484512, 14676.55970320892, 14996.700065998837, 15084.094954302776, 15339.156346401054, 25633.0, 30791.84604076965, 31560.0, 31682.524762128127, 31990.84004579962, 36702.44946325754, 37917.43123853199, 39868.800655996536, 43452.56547434612, 45136.54863451324, 7678.808029799076, 7783.455158138876, 7791.220877912164, 7859.135495095421, 7913.248241417056, 10481.842772358574, 11266.04238639692, 11273.549058037586, 11502.712432189262, 11797.52809887595, 10265.692029239135, 10616.469176541297, 10745.623903163665, 10851.728706782395, 11063.059639930696, 10556.736081598021, 10796.298240614335, 10858.294210876267, 10941.398223097805, 10952.561897524329, 10702.411367374869, 10853.674389768319, 10914.945425272823, 11087.390193539433, 11423.771524569296, 7788.337991270805, 7857.895678803739, 7860.528368297921, 7968.282854543119, 8107.1892810718455, 10441.843372349573, 11163.0, 11207.887921121011, 11212.103031757277, 11332.6033588824], "unit": "score", "name": "jquery.html", "value": 8267.374395342435}, {"lowerIsBetter": false, "replicates": [1391.6451304917246, 1503.894727369084, 1506.0286115455528, 1687.9746803797946, 1838.4392760208132, 7118.537295075823, 7476.252374762528, 7625.428092893041, 7674.50115742477, 7682.0, 7754.961225193881, 7924.92075079249, 8009.4793838400465, 8013.358931285483, 8022.598870056503, 2003.058562475634, 2244.3603572981624, 2285.337252196861, 2311.133325003124, 2317.9420514487188, 2330.976690233093, 2337.602607556711, 2339.578875802363, 2340.941476463085, 2342.004648024583, 2230.4981379189635, 2327.767223277676, 2328.8020518255967, 2330.627099664054, 2330.8718020508863, 2285.3715228312262, 2326.0230703104653, 2344.8358614896965, 2345.6598793175067, 2345.9648105278347, 2283.337832028726, 2291.724993000834, 2307.1694190091553, 2307.4462129089065, 2321.0947730385165, 8003.799905002364, 8050.074241462248, 8053.838923221561, 8064.717734879251, 8066.7579972600915, 4716.292556116576, 4862.586680132193, 4862.6839255448285, 4865.537773911473, 4875.024995001014, 3121.547375630521, 3202.96797032029, 3217.7747557670973, 3230.1440118368414, 3256.4138455078078, 1024.6260115058026, 1908.9618207635908, 1909.2935613822835, 1914.4161030885575, 1917.3481016454332, 10885.782284354347, 10922.945385273102, 10936.945315273453, 10942.0, 10993.340399576051, 3986.481757371523, 4107.342825147962, 4135.441715368447, 4167.541570427251, 4219.303814870574, 8556.10160933093, 8563.785905352415, 8655.047944726075, 8662.956685216534, 8667.263282620921, 4216.620504154579, 4800.087983283165, 4807.495213002584, 4815.590674792682, 4834.057358815067, 4215.473065866767, 4288.978555107205, 4308.0306930940915, 4310.353446982915, 4325.113351762881, 3376.712979396779, 3436.2096717754557, 3457.567804024497, 3495.8426870790877, 3530.541029666127, 1059.7880423915249, 1062.3307316390778, 1066.2323127348297, 1067.8184708599556, 1085.066842515436, 1343.375330471316, 1346.340293256317, 1376.4356613788298, 1379.2345248387041, 1397.2524699285834, 7569.5079819811535, 7767.456278060482, 7778.92221077782, 7789.260020298176, 7790.883136752953, 469.4859129253462, 481.16037514537356, 490.69576862345576, 493.1739336611162, 495.02974170625976, 5750.396208398058, 5776.5089967352405, 5780.508656764138, 5824.039033559416, 5828.358880523139, 9430.151286384258, 10025.047620476043, 10100.242481813893, 10113.898861011443, 10132.848007279898, 9827.0, 9893.653722119836, 9935.155511781579, 9956.153726933291, 9996.150327222267, 7456.142543607554, 7703.0, 7728.574928378881, 7741.729039483591, 7806.648700808477, 7360.263973602597, 7385.335319821027, 7404.259574042552, 7406.814829629302, 7427.7771666850085, 8364.3726720495, 8664.826703466022, 8771.868421973548, 8775.0, 8794.692185773467, 8593.968723753189, 8880.467171969702, 8914.821703565764, 8918.598663060047, 8932.46405215689, 6302.464290535356, 6760.290169532325, 6991.161060672548, 7220.8916866246, 7339.1926888043345, 7548.0, 7571.962140189264, 7572.8485430292185, 7607.88588171189, 7609.162992070978, 6674.232463266787, 6806.115205023315, 6808.727650894107, 6928.757493487704, 6953.374196322356, 6867.107276054081, 6868.210155832143, 6986.336298051677, 7083.1854336749875, 7087.893681594677, 7101.11236095488, 7122.715091396493, 7171.0, 7263.128424589083, 7300.379467745089, 6633.867322653424, 6655.301193374819, 6694.83262918431, 6711.697973591297, 6712.093867327848, 6546.214454265519, 6656.30108838565, 6686.465082793462, 6688.565243259172, 6706.262311145868], "unit": "score", "name": "mootools.html", "value": 4523.653753284395}, {"lowerIsBetter": false, "replicates": [327.147780033014, 329.3166679140783, 335.95632567766194, 336.9376665316915, 337.2748590530359, 5774.307083150023, 5847.532197424206, 5849.239598852154, 5862.149988251701, 5873.353931067584, 5761.30864296284, 5769.249997500319, 5770.221020162277, 5778.0, 5788.42115788421, 4270.295401258789, 4330.501992270898, 4388.100439409929, 4453.064856380164, 4466.776661166945, 4411.64706823455, 4431.578999994996, 4442.0, 4453.821847126127, 4466.910661786762, 4271.765052922104, 4404.889877753066, 4422.270325396322, 4422.7788610569505, 4429.623482004034, 4329.415528903589, 4348.152110338469, 4357.629601483878, 4417.668674849399, 4419.955800441987, 3896.201278737852, 3913.7064720146104, 3914.7846868422225, 3926.666233370167, 3928.626780455852, 5518.33779946405, 5549.72251387429, 5558.0, 5572.58205634575, 5577.581681373913, 5194.92207616886, 5199.818006369759, 5218.008578370098, 5223.138182199932, 5223.660462069991, 6171.567990240685, 6202.906956395657, 6233.96883015582, 6234.1583886175695, 6234.812955611294, 4092.6112019358116, 4204.5375008749015, 4207.621314081717, 4220.345846393814, 4372.584604462571, 6384.776532821329, 6436.967815160941, 6446.290908000116, 6450.387213214737, 6452.612843229421, 4374.256376416017, 4376.715513491613, 4377.759223242689, 4379.4525684289465, 4381.277089280296, 4435.622972047412, 4436.822527098944, 4438.312061630452, 4441.644668426518, 4441.822327106879, 5134.691918484828, 5140.126178549655, 5140.563052140536, 5149.845504634867, 5152.3044389007755, 6076.787312444043, 6203.906941395882, 6231.470325022424, 6236.407541283571, 6236.968815155895, 1530.8545688159606, 1548.79865617469, 1558.5558115936904, 1560.6332511859705, 1562.3203906300796, 964.1226483899618, 1008.969730908074, 1013.3717095400751, 1022.6807418430142, 1039.8076355874186, 5842.152887831241, 5994.280686317583, 5996.790112346047, 6003.609765365237, 6015.639061656315, 6447.516436267299, 6448.065030570541, 6450.451711604566, 6453.386928241809, 6453.580517266457, 5964.552658550626, 5982.940170598238, 5985.132155837467, 6040.788572399945, 6050.515958723292, 3427.2974040321674, 3462.8787992420143, 3466.930661386758, 3467.427874400746, 3474.583050034012, 6595.967020164964, 6786.0, 6793.116894803644, 6803.217629972616, 6833.5216534843075, 6565.441937435371, 6591.209054913441, 6597.1423714916755, 6606.6036037837885, 6620.8344791380605, 6771.153605799275, 6774.593524388552, 6782.864342713118, 6796.35434633709, 6804.65976701163, 6414.262359828679, 6428.485721142204, 6431.389018043278, 6434.195725534309, 6452.741890324334, 6174.783882564088, 6332.113504109337, 6381.680915954091, 6429.32492088324, 6456.644884531208, 6750.459963202834, 6780.96609516969, 6790.796276111724, 6807.9319206807295, 6814.693338799865, 4322.0491491871735, 4367.257566213688, 4384.188925048876, 4386.978065109782, 4391.802368893344, 6449.935500644933, 6458.870822583428, 6459.095726598186, 6461.19235095613, 6467.191601049869, 6233.719482623203, 6242.344553821965, 6251.249850018027, 6252.406021427957, 6260.280067792262, 6054.39456054391, 6201.56589038781, 6222.875542489215, 6248.343923887926, 6251.156093927443, 6115.816525504242, 6134.0, 6136.846578835565, 6141.84645383869, 6142.600730952474, 6210.285817130907, 6266.154069200782, 6280.623162610258, 6307.936920630735, 6343.682815859281, 5901.557383196192, 5954.37479064692, 6126.479249263684, 6131.356207598138, 6137.539684523768], "unit": "score", "name": "prototype.html", "value": 4679.522968728485}, {"lowerIsBetter": false, "replicates": [791.8495485857691, 814.4746638418225, 815.3355015662235, 829.0548774397188, 835.6657337065175, 13633.65915852103, 13939.790903136449, 13942.302884855768, 13974.0, 13989.720205595882, 11762.647120586375, 12126.69683257919, 12139.817902731465, 12175.452104655289, 13022.088453808237, 820.5856042698429, 826.2935190412201, 832.1886160993043, 832.5129799067553, 833.6082041440544, 833.3832963606917, 834.9248567628912, 835.9164083591653, 837.3887062444388, 839.911809260028, 861.444368382393, 876.6800117956964, 877.903430622631, 879.4151888993844, 879.4195830751705, 852.654674856684, 867.3061550759398, 868.9826203475958, 869.42183448007, 869.6651789061225, 632.5983000794482, 635.8823617630753, 644.5005121031191, 645.132297060453, 645.8030300758267, 12525.43635536394, 12637.304948227844, 12667.36663166838, 12691.682707932283, 12724.681882952907, 11027.338359698444, 11338.0, 11408.71478213043, 11512.366819824907, 11538.250013749164, 9861.654842080492, 9893.0, 9945.0, 10105.0, 10123.29136960413, 3574.4817001534634, 3593.838277277529, 3599.262151258986, 3716.9442458363146, 3733.850645974158, 45805.08389832185, 46317.53682463166, 46515.767421163015, 46546.53453465456, 46574.767126164494, 8618.310535157298, 8653.783655408664, 8792.0, 8891.333150013645, 9176.128267814547, 16710.331586736636, 16742.83257167437, 16820.0, 16827.242774075195, 16837.747433788503, 7506.249375062559, 7599.506032107895, 7653.11989121247, 7722.884156737653, 7746.767596972099, 4227.217964676544, 4336.956630433655, 4451.77741112943, 4495.842645507391, 4558.020025694492, 2965.0363631819746, 2995.2811325281777, 3002.9699703003125, 3006.1582756828125, 3014.5327474241526, 551.4705882352906, 555.4251349852883, 558.0958846668423, 558.4973523828587, 566.0010082204911, 629.8725281745716, 681.3322943515284, 691.5263044814218, 708.0547469128668, 721.2571051816637, 8267.751967440987, 8344.41589088758, 8663.090375510481, 8795.340349473687, 8893.599788009555, 555.4205575033872, 673.9224989126216, 686.8941004981975, 707.3245050976305, 708.1643660480682, 3872.3223435898603, 3944.5660977292473, 3954.6638535724787, 4036.7577945323374, 4237.343211802176, 53694.0, 53966.0, 54591.0, 54820.72589637106, 55024.44975550193, 41486.585134148874, 46092.53907460949, 46377.30434043492, 53107.73446132745, 55257.723711381186, 44698.0, 45286.09427811425, 46466.53533464622, 47083.293750593766, 47902.0, 7891.0, 8155.388345873965, 8191.590420479071, 8278.296344810518, 8367.832643347221, 33169.0, 33191.33617327688, 33206.16984575308, 33468.832655836566, 34030.0, 40278.597214028654, 41350.1729965405, 41840.0, 42467.1506569873, 42793.358099627905, 11362.772744544898, 11545.595904143314, 11673.12451566119, 11825.881741182822, 11837.526498940291, 12540.498380064695, 12592.370381480707, 12647.304398258184, 12709.93645031769, 13018.609441716764, 11394.0, 11742.295462272292, 12025.158238923192, 12481.750364992831, 12730.490780368682, 11922.463489143183, 11972.820407693718, 12293.0, 12509.311987840756, 12589.559365422167, 11648.0, 12152.75694486123, 12332.383380830743, 12401.689957751129, 12445.62663120108, 9809.117179453884, 9988.550515226978, 10010.799784004425, 10016.0, 10178.898211017795, 8974.775630609025, 9540.713778586654, 9935.801283974135, 9976.2517811163, 9987.650432234837], "unit": "score", "name": "yui.html", "value": 6283.387285972766}], "name": "dromaeo_css", "value": 6853.202351989641}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 113.0, 110.0, 112.0, 111.0, 113.0, 101.0, 111.0, 111.0, 110.0], "unit": "score", "name": "ai-astar", "value": 110.3}, {"lowerIsBetter": true, "replicates": [159.0, 127.0, 150.0, 167.0, 129.0, 160.0, 160.0, 132.0, 172.0, 128.0], "unit": "score", "name": "audio-beat-detection", "value": 148.4}, {"lowerIsBetter": true, "replicates": [161.0, 161.0, 162.0, 159.0, 161.0, 160.0, 162.0, 170.0, 164.0, 164.0], "unit": "score", "name": "audio-dft", "value": 162.4}, {"lowerIsBetter": true, "replicates": [76.0, 76.0, 110.0, 93.0, 73.0, 73.0, 73.0, 113.0, 105.0, 72.0], "unit": "score", "name": "audio-fft", "value": 86.4}, {"lowerIsBetter": true, "replicates": [94.0, 94.0, 136.0, 94.0, 93.0, 94.0, 149.0, 94.0, 94.0, 134.0], "unit": "score", "name": "audio-oscillator", "value": 107.6}, {"lowerIsBetter": true, "replicates": [117.0, 117.0, 117.0, 117.0, 118.0, 118.0, 118.0, 117.0, 116.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 117.2}, {"lowerIsBetter": true, "replicates": [145.0, 146.0, 145.0, 147.0, 147.0, 148.0, 146.0, 145.0, 145.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 146.1}, {"lowerIsBetter": true, "replicates": [96.0, 97.0, 95.0, 96.0, 97.0, 96.0, 96.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.1}, {"lowerIsBetter": true, "replicates": [57.0, 57.0, 58.0, 58.0, 58.0, 59.0, 57.0, 66.0, 56.0, 60.0], "unit": "score", "name": "json-parse-financial", "value": 58.6}, {"lowerIsBetter": true, "replicates": [66.0, 67.0, 67.0, 67.0, 67.0, 68.0, 68.0, 66.0, 67.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.0}, {"lowerIsBetter": true, "replicates": [81.0, 83.0, 83.0, 85.0, 85.0, 82.0, 82.0, 82.0, 82.0, 82.0], "unit": "score", "name": "stanford-crypto-aes", "value": 82.7}, {"lowerIsBetter": true, "replicates": [115.0, 114.0, 120.0, 113.0, 113.0, 120.0, 113.0, 114.0, 118.0, 118.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 115.8}, {"lowerIsBetter": true, "replicates": [151.0, 143.0, 150.0, 149.0, 148.0, 146.0, 151.0, 148.0, 150.0, 149.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 148.5}, {"lowerIsBetter": true, "replicates": [69.0, 70.0, 70.0, 70.0, 70.0, 68.0, 67.0, 70.0, 69.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 69.0}], "name": "kraken", "value": 1516.1000000000001}]} 19:20:43 INFO - Return code: 0 19:20:43 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 19:20:43 INFO - # TBPL SUCCESS # 19:20:43 INFO - Running post-action listener: _resource_record_post_action 19:20:43 INFO - Running post-run listener: _resource_record_post_run 19:20:44 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 16384; Write bytes: 532602880; Read time: 316; Write time: 486856 19:20:44 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 4096; Write bytes: 240291840; Read time: 220; Write time: 264172 19:20:44 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 12288; Write bytes: 291713024; Read time: 96; Write time: 222684 19:20:44 INFO - Running post-run listener: _upload_blobber_files 19:20:44 INFO - Blob upload gear active. 19:20:44 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 19:20:44 INFO - Files from /builds/slave/test-pgo/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 19:20:44 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Mozilla-Inbound', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 19:20:44 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Mozilla-Inbound -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 19:20:45 INFO - (blobuploader) - INFO - Open directory for files ... 19:20:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 19:20:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:20:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:20:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 19:20:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:20:45 INFO - (blobuploader) - INFO - Done attempting. 19:20:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 19:20:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 19:20:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 19:20:46 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 19:20:46 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 19:20:46 INFO - (blobuploader) - INFO - Done attempting. 19:20:46 INFO - (blobuploader) - INFO - Iteration through files over. 19:20:46 INFO - Return code: 0 19:20:46 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 19:20:46 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 19:20:46 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/34d1bb3aac9ae9cb4c5f26b931aea0c8d7bed6831bdffcdcc9ecc7b9d25b687a137b2e220a5878814cccd9f99eecf012748658d6622fe1a6e0ac43f0f8d8091e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/80c05770dbbd0bbcbc24aa6822a11d053c209c03a369969ad9dfc45900613b370c3792fe8756f7c82b26ab1378ccbea5ca5f34f6c982b6bf38b4f4196937d75a"} 19:20:46 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 19:20:46 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 19:20:46 INFO - Contents: 19:20:46 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/34d1bb3aac9ae9cb4c5f26b931aea0c8d7bed6831bdffcdcc9ecc7b9d25b687a137b2e220a5878814cccd9f99eecf012748658d6622fe1a6e0ac43f0f8d8091e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/80c05770dbbd0bbcbc24aa6822a11d053c209c03a369969ad9dfc45900613b370c3792fe8756f7c82b26ab1378ccbea5ca5f34f6c982b6bf38b4f4196937d75a"} 19:20:46 INFO - Running post-run listener: copy_logs_to_upload_dir 19:20:46 INFO - Copying logs to upload dir... 19:20:46 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 19:20:46 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.341494 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2016-03-05 19:20:45.496877) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-05 19:20:45.500575) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/34d1bb3aac9ae9cb4c5f26b931aea0c8d7bed6831bdffcdcc9ecc7b9d25b687a137b2e220a5878814cccd9f99eecf012748658d6622fe1a6e0ac43f0f8d8091e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/80c05770dbbd0bbcbc24aa6822a11d053c209c03a369969ad9dfc45900613b370c3792fe8756f7c82b26ab1378ccbea5ca5f34f6c982b6bf38b4f4196937d75a"} build_url:https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010997 build_url: 'https://queue.taskcluster.net/v1/task/O0izjTdkQUC9eCpMLMvJ6g/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/34d1bb3aac9ae9cb4c5f26b931aea0c8d7bed6831bdffcdcc9ecc7b9d25b687a137b2e220a5878814cccd9f99eecf012748658d6622fe1a6e0ac43f0f8d8091e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/80c05770dbbd0bbcbc24aa6822a11d053c209c03a369969ad9dfc45900613b370c3792fe8756f7c82b26ab1378ccbea5ca5f34f6c982b6bf38b4f4196937d75a"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-05 19:20:45.524429) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:20:45.524706) ========= 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=516f8d7ca085b4d087ab0a71000001a4-1457229907.369811-1712128305 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004505 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-05 19:20:45.608610) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-05 19:20:45.608884) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-05 19:20:45.609133) ========= ========= Total master_lag: 1.17 =========