builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-008 starttime: 1458607482.27 results: success (0) buildid: 20160321151327 builduid: f09b80538b8347d28db1a52cb6801e47 revision: 351882d470a769b8e185deeda24a4ddffb19c105 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:42.267172) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:42.267632) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:42.267932) ========= 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=32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006373 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.15 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:42.427430) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:42.427724) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:42.848583) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:42.848982) ========= 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=32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004707 ========= master_lag: 0.20 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:43.051799) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:43.052106) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:43.052470) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:43.052768) ========= 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=32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-21 17:44:43-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 67.3M=0s 2016-03-21 17:44:43 (67.3 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.616779 ========= master_lag: 0.32 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:43.990975) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:43.991244) ========= 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=32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019393 ========= master_lag: 0.16 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:44.173280) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-03-21 17:44:44.173618) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 351882d470a769b8e185deeda24a4ddffb19c105 --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 351882d470a769b8e185deeda24a4ddffb19c105 --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=32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-21 17:44:44,394 truncating revision to first 12 chars 2016-03-21 17:44:44,394 Setting DEBUG logging. 2016-03-21 17:44:44,395 attempt 1/10 2016-03-21 17:44:44,395 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/351882d470a7?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-21 17:44:45,975 unpacking tar archive at: mozilla-aurora-351882d470a7/testing/mozharness/ program finished with exit code 0 elapsedTime=2.625828 ========= master_lag: 0.11 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 2 secs) (at 2016-03-21 17:44:46.906971) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:46.907300) ========= echo 351882d470a769b8e185deeda24a4ddffb19c105 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'351882d470a769b8e185deeda24a4ddffb19c105'] 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=32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 351882d470a769b8e185deeda24a4ddffb19c105 program finished with exit code 0 elapsedTime=0.004760 script_repo_revision: '351882d470a769b8e185deeda24a4ddffb19c105' ========= master_lag: 0.24 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:47.152485) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:47.152833) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-21 17:44:47.780857) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 15 secs) (at 2016-03-21 17:44:47.781279) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 17:44:48 INFO - MultiFileLogger online at 20160321 17:44:48 in /builds/slave/test-pgo 17:44:48 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 17:44:48 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 17:44:48 INFO - {'append_to_log': False, 17:44:48 INFO - 'base_work_dir': '/builds/slave/test-pgo', 17:44:48 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 17:44:48 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 17:44:48 INFO - 'branch': 'Mozilla-Aurora', 17:44:48 INFO - 'buildbot_json_path': 'buildprops.json', 17:44:48 INFO - 'config_files': ('talos/linux_config.py',), 17:44:48 INFO - 'default_actions': ('clobber', 17:44:48 INFO - 'read-buildbot-config', 17:44:48 INFO - 'download-and-extract', 17:44:48 INFO - 'populate-webroot', 17:44:48 INFO - 'create-virtualenv', 17:44:48 INFO - 'install', 17:44:48 INFO - 'run-tests'), 17:44:48 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 17:44:48 INFO - 'download_minidump_stackwalk': True, 17:44:48 INFO - 'download_symbols': 'ondemand', 17:44:48 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 17:44:48 INFO - 'tooltool.py': '/tools/tooltool.py', 17:44:48 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 17:44:48 INFO - '/tools/misc-python/virtualenv.py')}, 17:44:48 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 17:44:48 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 17:44:48 INFO - 'installer_path': 'installer.exe', 17:44:48 INFO - 'log_level': 'info', 17:44:48 INFO - 'log_name': 'talos', 17:44:48 INFO - 'log_to_console': True, 17:44:48 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 17:44:48 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 17:44:48 INFO - 'opt_config_files': (), 17:44:48 INFO - 'pip_index': False, 17:44:48 INFO - 'sps_profile': False, 17:44:48 INFO - 'sps_profile_interval': 0, 17:44:48 INFO - 'suite': 'dromaeojs', 17:44:48 INFO - 'system_bits': '32', 17:44:48 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 17:44:48 INFO - 'title': 'talos-linux64-ix-008', 17:44:48 INFO - 'tooltool_cache': '/builds/tooltool_cache', 17:44:48 INFO - 'use_talos_json': True, 17:44:48 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 17:44:48 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 17:44:48 INFO - 'work_dir': 'build'} 17:44:48 INFO - ##### 17:44:48 INFO - ##### Running clobber step. 17:44:48 INFO - ##### 17:44:48 INFO - Running pre-action listener: _resource_record_pre_action 17:44:48 INFO - Running main action method: clobber 17:44:48 INFO - rmtree: /builds/slave/test-pgo/build 17:44:48 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 17:44:48 INFO - Running post-action listener: _resource_record_post_action 17:44:48 INFO - ##### 17:44:48 INFO - ##### Running read-buildbot-config step. 17:44:48 INFO - ##### 17:44:48 INFO - Running pre-action listener: _resource_record_pre_action 17:44:48 INFO - Running main action method: read_buildbot_config 17:44:48 INFO - Using buildbot properties: 17:44:48 INFO - { 17:44:48 INFO - "project": "", 17:44:48 INFO - "product": "firefox", 17:44:48 INFO - "script_repo_revision": "production", 17:44:48 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 17:44:48 INFO - "repository": "", 17:44:48 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 17:44:48 INFO - "buildid": "20160321151327", 17:44:48 INFO - "pgo_build": "True", 17:44:48 INFO - "basedir": "/builds/slave/test-pgo", 17:44:48 INFO - "buildnumber": 364, 17:44:48 INFO - "slavename": "talos-linux64-ix-008", 17:44:48 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 17:44:48 INFO - "platform": "ubuntu64_hw", 17:44:48 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 17:44:48 INFO - "branch": "mozilla-aurora", 17:44:48 INFO - "repo_path": "releases/mozilla-aurora", 17:44:48 INFO - "revision": "351882d470a769b8e185deeda24a4ddffb19c105", 17:44:48 INFO - "stage_platform": "linux64-pgo", 17:44:48 INFO - "builduid": "f09b80538b8347d28db1a52cb6801e47", 17:44:48 INFO - "slavebuilddir": "test" 17:44:48 INFO - } 17:44:48 INFO - Found installer url https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2. 17:44:48 INFO - Running post-action listener: _resource_record_post_action 17:44:48 INFO - ##### 17:44:48 INFO - ##### Running download-and-extract step. 17:44:48 INFO - ##### 17:44:48 INFO - Running pre-action listener: _resource_record_pre_action 17:44:48 INFO - Running main action method: download_and_extract 17:44:48 INFO - mkdir: /builds/slave/test-pgo/build/tests 17:44: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')]} 17:44:48 INFO - https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 17:44:48 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 17:44:48 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 17:44:48 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 17:44:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 17:44:51 INFO - Downloaded 1448 bytes. 17:44:51 INFO - Reading from file /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 17:44:51 INFO - Using the following test package requirements: 17:44:51 INFO - {u'common': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 17:44:51 INFO - u'cppunittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 17:44:51 INFO - u'firefox-47.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 17:44:51 INFO - u'gtest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 17:44:51 INFO - u'firefox-47.0a2.en-US.linux-x86_64.gtest.tests.zip'], 17:44:51 INFO - u'jittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 17:44:51 INFO - u'jsshell-linux-x86_64.zip'], 17:44:51 INFO - u'mochitest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 17:44:51 INFO - u'firefox-47.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 17:44:51 INFO - u'mozbase': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 17:44:51 INFO - u'reftest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 17:44:51 INFO - u'firefox-47.0a2.en-US.linux-x86_64.reftest.tests.zip'], 17:44:51 INFO - u'talos': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 17:44:51 INFO - u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'], 17:44:51 INFO - u'web-platform': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 17:44:51 INFO - u'firefox-47.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 17:44:51 INFO - u'webapprt': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 17:44:51 INFO - u'xpcshell': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 17:44:51 INFO - u'firefox-47.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 17:44:51 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 17:44:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:44:51 INFO - https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 17:44:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 17:44:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 17:44:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 17:44:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 17:45:02 INFO - Downloaded 23310135 bytes. 17:45:02 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 17:45:02 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 17:45:03 INFO - Return code: 0 17:45:03 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 17:45:03 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')]} 17:45:03 INFO - https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 17:45:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 17:45:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 17:45:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 17:45:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 17:45:11 INFO - Downloaded 23310135 bytes. 17:45:11 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 17:45:11 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 17:45:12 INFO - Return code: 0 17:45:12 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')]} 17:45:12 INFO - https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 17:45:12 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 17:45:12 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 17:45:12 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 17:45:12 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 17:45:15 INFO - Downloaded 10845161 bytes. 17:45:15 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 17:45:15 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 17:45:15 INFO - Return code: 0 17:45:15 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')]} 17:45:15 INFO - https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 17:45:15 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 17:45:15 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 17:45:15 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 17:45:15 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 17:45:18 INFO - Downloaded 60446936 bytes. 17:45:18 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 17:45:18 INFO - mkdir: /builds/slave/test-pgo/properties 17:45:18 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 17:45:18 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 17:45:18 INFO - Contents: 17:45:18 INFO - build_url:https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 17:45:19 INFO - Running post-action listener: _resource_record_post_action 17:45:19 INFO - Running post-action listener: set_extra_try_arguments 17:45:19 INFO - ##### 17:45:19 INFO - ##### Running populate-webroot step. 17:45:19 INFO - ##### 17:45:19 INFO - Running pre-action listener: _resource_record_pre_action 17:45:19 INFO - Running main action method: populate_webroot 17:45:19 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 17:45:19 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 17:45:19 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 17:45:19 INFO - '--tppagecycles', 17:45:19 INFO - '7'], 17:45:19 INFO - 'tests': ['tsvgm']}}, 17:45:19 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 17:45:19 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 17:45:19 INFO - 'tests': ['tresize', 'tcanvasmark']}, 17:45:19 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 17:45:19 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 17:45:19 INFO - 'tests': ['dromaeo_css', 'kraken']}, 17:45:19 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:45:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:45:19 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:45:19 INFO - 'talos_options': ['--e10s'], 17:45:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 17:45:19 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:45:19 INFO - 'tests': ['damp', 'tps']}, 17:45:19 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:45:19 INFO - 'talos_options': ['--e10s'], 17:45:19 INFO - 'tests': ['damp', 'tps']}, 17:45:19 INFO - 'g3': {'tests': ['dromaeo_dom']}, 17:45:19 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 17:45:19 INFO - 'other': {'tests': ['a11yr', 17:45:19 INFO - 'ts_paint', 17:45:19 INFO - 'tpaint', 17:45:19 INFO - 'sessionrestore', 17:45:19 INFO - 'sessionrestore_no_auto_restore', 17:45:19 INFO - 'tabpaint']}, 17:45:19 INFO - 'other-e10s': {'talos_options': ['--e10s'], 17:45:19 INFO - 'tests': ['a11yr', 17:45:19 INFO - 'ts_paint', 17:45:19 INFO - 'tpaint', 17:45:19 INFO - 'sessionrestore', 17:45:19 INFO - 'sessionrestore_no_auto_restore', 17:45:19 INFO - 'tabpaint']}, 17:45:19 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 17:45:19 INFO - 'tests': ['a11yr', 17:45:19 INFO - 'ts_paint', 17:45:19 INFO - 'tpaint', 17:45:19 INFO - 'sessionrestore', 17:45:19 INFO - 'sessionrestore_no_auto_restore', 17:45:19 INFO - 'tabpaint']}, 17:45:19 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 17:45:19 INFO - 'tests': ['a11yr', 17:45:19 INFO - 'ts_paint', 17:45:19 INFO - 'tpaint', 17:45:19 INFO - 'sessionrestore', 17:45:19 INFO - 'sessionrestore_no_auto_restore', 17:45:19 INFO - 'tabpaint']}, 17:45:19 INFO - 'other_l64': {'tests': ['a11yr', 17:45:19 INFO - 'ts_paint', 17:45:19 INFO - 'tpaint', 17:45:19 INFO - 'sessionrestore', 17:45:19 INFO - 'sessionrestore_no_auto_restore', 17:45:19 INFO - 'tabpaint']}, 17:45:19 INFO - 'other_nol64': {'tests': ['a11yr', 17:45:19 INFO - 'ts_paint', 17:45:19 INFO - 'tpaint', 17:45:19 INFO - 'sessionrestore', 17:45:19 INFO - 'sessionrestore_no_auto_restore', 17:45:19 INFO - 'tabpaint']}, 17:45:19 INFO - 'svgr': {'tests': ['tsvgx', 17:45:19 INFO - 'tsvgr_opacity', 17:45:19 INFO - 'tart', 17:45:19 INFO - 'tscrollx', 17:45:19 INFO - 'cart']}, 17:45:19 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 17:45:19 INFO - 'tests': ['tsvgx', 17:45:19 INFO - 'tsvgr_opacity', 17:45:19 INFO - 'tart', 17:45:19 INFO - 'tscrollx', 17:45:19 INFO - 'cart']}, 17:45:19 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:45:19 INFO - 'tests': ['tp5o']}, 17:45:19 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:45:19 INFO - 'talos_options': ['--e10s'], 17:45:19 INFO - 'tests': ['tp5o']}, 17:45:19 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:45:19 INFO - 'talos_options': ['--xperf_path', 17:45:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:45:19 INFO - 'tests': ['tp5n']}, 17:45:19 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 17:45:19 INFO - 'talos_options': ['--e10s', 17:45:19 INFO - '--xperf_path', 17:45:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 17:45:19 INFO - 'tests': ['tp5n']}}, 17:45:19 INFO - 'talos.zip': {'path': '', 17:45:19 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 17:45:19 INFO - Running post-action listener: _resource_record_post_action 17:45:19 INFO - ##### 17:45:19 INFO - ##### Running create-virtualenv step. 17:45:19 INFO - ##### 17:45:19 INFO - Running pre-action listener: _resource_record_pre_action 17:45:19 INFO - Running main action method: create_virtualenv 17:45:19 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 17:45:19 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test-pgo/build/venv'] in /builds/slave/test-pgo/build 17:45:19 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 17:45:19 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 17:45:19 INFO - Using real prefix '/usr' 17:45:19 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 17:45:20 INFO - Installing distribute.............................................................................................................................................................................................done. 17:45:22 INFO - Installing pip.................done. 17:45:22 INFO - Return code: 0 17:45:22 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 17:45:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:45:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:45:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:45:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:45:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:22 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 0x7fbecd284f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23668a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24336d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, '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': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', '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 17:45:22 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 17:45:22 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 17:45:22 INFO - Using env: {'DISPLAY': ':0', 17:45:22 INFO - 'HOME': '/home/cltbld', 17:45:22 INFO - 'LANG': 'en_US.UTF-8', 17:45:22 INFO - 'LANGUAGE': 'en_US:en', 17:45:22 INFO - 'LOGNAME': 'cltbld', 17:45:22 INFO - 'MAIL': '/var/mail/cltbld', 17:45:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:45:22 INFO - 'MOZ_NO_REMOTE': '1', 17:45:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:45:22 INFO - 'NO_EM_RESTART': '1', 17:45:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:45:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:45:22 INFO - 'PWD': '/builds/slave/test-pgo', 17:45:22 INFO - 'SHELL': '/bin/bash', 17:45:22 INFO - 'SHLVL': '1', 17:45:22 INFO - 'TERM': 'linux', 17:45:22 INFO - 'TMOUT': '86400', 17:45:22 INFO - 'USER': 'cltbld', 17:45:22 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:45:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:45:22 INFO - '_': '/tools/buildbot/bin/python'} 17:45:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:45:22 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 17:45:22 INFO - Cleaning up... 17:45:22 INFO - Return code: 0 17:45:22 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 17:45:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:45:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:45:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:45:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:45:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:22 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 0x7fbecd284f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23668a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24336d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, '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': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', '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 17:45:22 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 17:45:22 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 17:45:22 INFO - Using env: {'DISPLAY': ':0', 17:45:22 INFO - 'HOME': '/home/cltbld', 17:45:22 INFO - 'LANG': 'en_US.UTF-8', 17:45:22 INFO - 'LANGUAGE': 'en_US:en', 17:45:22 INFO - 'LOGNAME': 'cltbld', 17:45:22 INFO - 'MAIL': '/var/mail/cltbld', 17:45:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:45:22 INFO - 'MOZ_NO_REMOTE': '1', 17:45:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:45:22 INFO - 'NO_EM_RESTART': '1', 17:45:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:45:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:45:22 INFO - 'PWD': '/builds/slave/test-pgo', 17:45:22 INFO - 'SHELL': '/bin/bash', 17:45:22 INFO - 'SHLVL': '1', 17:45:22 INFO - 'TERM': 'linux', 17:45:22 INFO - 'TMOUT': '86400', 17:45:22 INFO - 'USER': 'cltbld', 17:45:22 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:45:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:45:22 INFO - '_': '/tools/buildbot/bin/python'} 17:45:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:45:22 INFO - Downloading/unpacking psutil>=0.7.1 17:45:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:22 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:22 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:22 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:22 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:27 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 17:45:27 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:45:27 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:45:27 INFO - Installing collected packages: psutil 17:45:27 INFO - Running setup.py install for psutil 17:45:27 INFO - building 'psutil._psutil_linux' extension 17:45:27 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 17:45:27 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 17:45:27 INFO - building 'psutil._psutil_posix' extension 17:45:27 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 17:45:28 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 17:45:28 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 17:45:28 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 17:45:28 INFO - Successfully installed psutil 17:45:28 INFO - Cleaning up... 17:45:28 INFO - Return code: 0 17:45:28 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 17:45:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:45:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:45:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:45:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:45:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:28 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 0x7fbecd284f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23668a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24336d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, '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': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', '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 17:45:28 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 17:45:28 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 17:45:28 INFO - Using env: {'DISPLAY': ':0', 17:45:28 INFO - 'HOME': '/home/cltbld', 17:45:28 INFO - 'LANG': 'en_US.UTF-8', 17:45:28 INFO - 'LANGUAGE': 'en_US:en', 17:45:28 INFO - 'LOGNAME': 'cltbld', 17:45:28 INFO - 'MAIL': '/var/mail/cltbld', 17:45:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:45:28 INFO - 'MOZ_NO_REMOTE': '1', 17:45:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:45:28 INFO - 'NO_EM_RESTART': '1', 17:45:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:45:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:45:28 INFO - 'PWD': '/builds/slave/test-pgo', 17:45:28 INFO - 'SHELL': '/bin/bash', 17:45:28 INFO - 'SHLVL': '1', 17:45:28 INFO - 'TERM': 'linux', 17:45:28 INFO - 'TMOUT': '86400', 17:45:28 INFO - 'USER': 'cltbld', 17:45:28 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:45:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:45:28 INFO - '_': '/tools/buildbot/bin/python'} 17:45:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:45:28 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 17:45:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:31 INFO - Downloading mozsystemmonitor-0.0.tar.gz 17:45:31 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 17:45:31 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 17:45:31 INFO - Installing collected packages: mozsystemmonitor 17:45:31 INFO - Running setup.py install for mozsystemmonitor 17:45:32 INFO - Successfully installed mozsystemmonitor 17:45:32 INFO - Cleaning up... 17:45:32 INFO - Return code: 0 17:45:32 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 17:45:32 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')]} 17:45:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:45:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:32 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')]} 17:45:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:45:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:32 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 0x7fbecd284f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23668a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24336d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, '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': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', '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 17:45:32 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 17:45:32 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 17:45:32 INFO - Using env: {'DISPLAY': ':0', 17:45:32 INFO - 'HOME': '/home/cltbld', 17:45:32 INFO - 'LANG': 'en_US.UTF-8', 17:45:32 INFO - 'LANGUAGE': 'en_US:en', 17:45:32 INFO - 'LOGNAME': 'cltbld', 17:45:32 INFO - 'MAIL': '/var/mail/cltbld', 17:45:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:45:32 INFO - 'MOZ_NO_REMOTE': '1', 17:45:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:45:32 INFO - 'NO_EM_RESTART': '1', 17:45:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:45:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:45:32 INFO - 'PWD': '/builds/slave/test-pgo', 17:45:32 INFO - 'SHELL': '/bin/bash', 17:45:32 INFO - 'SHLVL': '1', 17:45:32 INFO - 'TERM': 'linux', 17:45:32 INFO - 'TMOUT': '86400', 17:45:32 INFO - 'USER': 'cltbld', 17:45:32 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:45:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:45:32 INFO - '_': '/tools/buildbot/bin/python'} 17:45:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:45:32 INFO - Downloading/unpacking blobuploader==1.2.4 17:45:32 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 17:45:32 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 17:45:32 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 17:45:32 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 17:45:32 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 17:45:32 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 17:45:36 INFO - Downloading blobuploader-1.2.4.tar.gz 17:45:36 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 17:45:36 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 17:45: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 17:45: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 17:45: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 17:45: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 17:45: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 17:45: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 17:45:37 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 17:45:37 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 17:45: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 17:45: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 17:45: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 17:45: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 17:45: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 17:45: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 17:45:37 INFO - Downloading docopt-0.6.1.tar.gz 17:45:37 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 17:45:37 INFO - Installing collected packages: blobuploader, requests, docopt 17:45:37 INFO - Running setup.py install for blobuploader 17:45:37 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 17:45:37 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 17:45:37 INFO - Running setup.py install for requests 17:45:38 INFO - Running setup.py install for docopt 17:45:38 INFO - Successfully installed blobuploader requests docopt 17:45:38 INFO - Cleaning up... 17:45:38 INFO - Return code: 0 17:45:38 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 17:45:38 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')]} 17:45:38 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:45:38 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:38 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')]} 17:45:38 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:45:38 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:38 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 0x7fbecd284f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23668a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24336d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, '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': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', '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 17:45:38 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 17:45:38 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 17:45:38 INFO - Using env: {'DISPLAY': ':0', 17:45:38 INFO - 'HOME': '/home/cltbld', 17:45:38 INFO - 'LANG': 'en_US.UTF-8', 17:45:38 INFO - 'LANGUAGE': 'en_US:en', 17:45:38 INFO - 'LOGNAME': 'cltbld', 17:45:38 INFO - 'MAIL': '/var/mail/cltbld', 17:45:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:45:38 INFO - 'MOZ_NO_REMOTE': '1', 17:45:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:45:38 INFO - 'NO_EM_RESTART': '1', 17:45:38 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:45:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:45:38 INFO - 'PWD': '/builds/slave/test-pgo', 17:45:38 INFO - 'SHELL': '/bin/bash', 17:45:38 INFO - 'SHLVL': '1', 17:45:38 INFO - 'TERM': 'linux', 17:45:38 INFO - 'TMOUT': '86400', 17:45:38 INFO - 'USER': 'cltbld', 17:45:38 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:45:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:45:38 INFO - '_': '/tools/buildbot/bin/python'} 17:45:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:45:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:45:38 INFO - Running setup.py (path:/tmp/pip-rl5MhC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:45:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:45:38 INFO - Running setup.py (path:/tmp/pip-BIsKO6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:45:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:45:38 INFO - Running setup.py (path:/tmp/pip-ML1OjJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:45:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:45:38 INFO - Running setup.py (path:/tmp/pip-cHYlo1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:45:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 17:45:38 INFO - Running setup.py (path:/tmp/pip-HP6MBX-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 17:45:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:45:38 INFO - Running setup.py (path:/tmp/pip-L6H7Js-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:45:38 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:45:38 INFO - Running setup.py (path:/tmp/pip-Pn0977-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:45:39 INFO - Running setup.py (path:/tmp/pip-bTCwFJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 17:45:39 INFO - Running setup.py (path:/tmp/pip-aeJ03i-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 17:45:39 INFO - Running setup.py (path:/tmp/pip-B0IpD_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:45:39 INFO - Running setup.py (path:/tmp/pip-ETS10x-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:45:39 INFO - Running setup.py (path:/tmp/pip-QV6olG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:45:39 INFO - Running setup.py (path:/tmp/pip-P1qvYH-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:45:39 INFO - Running setup.py (path:/tmp/pip-ZUxB2K-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:45:39 INFO - Running setup.py (path:/tmp/pip-kHYGTI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 17:45:39 INFO - Running setup.py (path:/tmp/pip-KDsiNM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 17:45:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 17:45:39 INFO - Running setup.py (path:/tmp/pip-vtaEQK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 17:45:39 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 17:45:39 INFO - Running setup.py install for manifestparser 17:45:39 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 17:45:39 INFO - Running setup.py install for mozcrash 17:45:39 INFO - Running setup.py install for mozdebug 17:45:40 INFO - Running setup.py install for mozdevice 17:45:40 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Running setup.py install for mozfile 17:45:40 INFO - Running setup.py install for mozhttpd 17:45:40 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Running setup.py install for mozinfo 17:45:40 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Running setup.py install for mozInstall 17:45:40 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Running setup.py install for mozleak 17:45:40 INFO - Running setup.py install for mozlog 17:45:40 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Running setup.py install for moznetwork 17:45:40 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 17:45:40 INFO - Running setup.py install for mozprocess 17:45:40 INFO - Running setup.py install for mozprofile 17:45:41 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 17:45:41 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 17:45:41 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 17:45:41 INFO - Running setup.py install for mozrunner 17:45:41 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 17:45:41 INFO - Running setup.py install for mozscreenshot 17:45:41 INFO - Running setup.py install for moztest 17:45:41 INFO - Running setup.py install for mozversion 17:45:41 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 17:45:41 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 17:45:41 INFO - Cleaning up... 17:45:41 INFO - Return code: 0 17:45:41 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 17:45:41 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')]} 17:45:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:45:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:41 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')]} 17:45:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:45:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:41 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 0x7fbecd284f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23668a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24336d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, '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': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', '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 17:45:41 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 17:45:41 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 17:45:41 INFO - Using env: {'DISPLAY': ':0', 17:45:41 INFO - 'HOME': '/home/cltbld', 17:45:41 INFO - 'LANG': 'en_US.UTF-8', 17:45:41 INFO - 'LANGUAGE': 'en_US:en', 17:45:41 INFO - 'LOGNAME': 'cltbld', 17:45:41 INFO - 'MAIL': '/var/mail/cltbld', 17:45:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:45:41 INFO - 'MOZ_NO_REMOTE': '1', 17:45:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:45:41 INFO - 'NO_EM_RESTART': '1', 17:45:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:45:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:45:41 INFO - 'PWD': '/builds/slave/test-pgo', 17:45:41 INFO - 'SHELL': '/bin/bash', 17:45:41 INFO - 'SHLVL': '1', 17:45:41 INFO - 'TERM': 'linux', 17:45:41 INFO - 'TMOUT': '86400', 17:45:41 INFO - 'USER': 'cltbld', 17:45:41 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:45:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:45:41 INFO - '_': '/tools/buildbot/bin/python'} 17:45:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:45:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:45:41 INFO - Running setup.py (path:/tmp/pip-YLXYkb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 17:45:41 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)) 17:45:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:45:41 INFO - Running setup.py (path:/tmp/pip-eTvX2M-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 17:45:41 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)) 17:45:41 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:45:41 INFO - Running setup.py (path:/tmp/pip-gP5GDN-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 17:45: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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:45:42 INFO - Running setup.py (path:/tmp/pip-LObcSY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 17:45: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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 17:45:42 INFO - Running setup.py (path:/tmp/pip-ZzG05h-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 17:45: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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:45:42 INFO - Running setup.py (path:/tmp/pip-toWh87-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:45:42 INFO - Running setup.py (path:/tmp/pip-JPwOZ9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:45:42 INFO - Running setup.py (path:/tmp/pip-gjcRP_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 17:45:42 INFO - Running setup.py (path:/tmp/pip-YU6aJW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 17:45:42 INFO - Running setup.py (path:/tmp/pip-yJ71of-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:45:42 INFO - Running setup.py (path:/tmp/pip-20WULB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:45:42 INFO - Running setup.py (path:/tmp/pip-9JcQuE-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:45:42 INFO - Running setup.py (path:/tmp/pip-oFQK_c-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:45:42 INFO - Running setup.py (path:/tmp/pip-fkhhDM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:45:42 INFO - Running setup.py (path:/tmp/pip-JZaCa9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 17:45:42 INFO - Running setup.py (path:/tmp/pip-zL_otv-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 17:45:42 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)) 17:45:42 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 17:45:42 INFO - Running setup.py (path:/tmp/pip-bjypBc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 17:45: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)) 17:45: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)) 17:45: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)) 17:45: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)) 17:45: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)) 17:45: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)) 17:45:43 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 17:45: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 17:45: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 17:45: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 17:45: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 17:45: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 17:45: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 17:45:47 INFO - Downloading blessings-1.6.tar.gz 17:45:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 17:45:47 INFO - Installing collected packages: blessings 17:45:47 INFO - Running setup.py install for blessings 17:45:47 INFO - Successfully installed blessings 17:45:47 INFO - Cleaning up... 17:45:48 INFO - Return code: 0 17:45:48 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 17:45:48 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 17:45:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 17:45:48 INFO - Reading from file tmpfile_stdout 17:45:48 INFO - Current package versions: 17:45:48 INFO - argparse == 1.2.1 17:45:48 INFO - blessings == 1.6 17:45:48 INFO - blobuploader == 1.2.4 17:45:48 INFO - docopt == 0.6.1 17:45:48 INFO - manifestparser == 1.1 17:45:48 INFO - mozInstall == 1.12 17:45:48 INFO - mozcrash == 0.17 17:45:48 INFO - mozdebug == 0.1 17:45:48 INFO - mozdevice == 0.48 17:45:48 INFO - mozfile == 1.2 17:45:48 INFO - mozhttpd == 0.7 17:45:48 INFO - mozinfo == 0.9 17:45:48 INFO - mozleak == 0.1 17:45:48 INFO - mozlog == 3.1 17:45:48 INFO - moznetwork == 0.27 17:45:48 INFO - mozprocess == 0.22 17:45:48 INFO - mozprofile == 0.28 17:45:48 INFO - mozrunner == 6.11 17:45:48 INFO - mozscreenshot == 0.1 17:45:48 INFO - mozsystemmonitor == 0.0 17:45:48 INFO - moztest == 0.7 17:45:48 INFO - mozversion == 1.4 17:45:48 INFO - psutil == 3.1.1 17:45:48 INFO - requests == 1.2.3 17:45:48 INFO - wsgiref == 0.1.2 17:45:48 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 17:45: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')]} 17:45:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:45:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45: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')]} 17:45:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:45:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:48 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 0x7fbecd284f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23668a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24336d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, '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': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', '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 17:45:48 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 17:45:48 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 17:45:48 INFO - Using env: {'DISPLAY': ':0', 17:45:48 INFO - 'HOME': '/home/cltbld', 17:45:48 INFO - 'LANG': 'en_US.UTF-8', 17:45:48 INFO - 'LANGUAGE': 'en_US:en', 17:45:48 INFO - 'LOGNAME': 'cltbld', 17:45:48 INFO - 'MAIL': '/var/mail/cltbld', 17:45:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:45:48 INFO - 'MOZ_NO_REMOTE': '1', 17:45:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:45:48 INFO - 'NO_EM_RESTART': '1', 17:45:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:45:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:45:48 INFO - 'PWD': '/builds/slave/test-pgo', 17:45:48 INFO - 'SHELL': '/bin/bash', 17:45:48 INFO - 'SHLVL': '1', 17:45:48 INFO - 'TERM': 'linux', 17:45:48 INFO - 'TMOUT': '86400', 17:45:48 INFO - 'USER': 'cltbld', 17:45:48 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:45:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:45:48 INFO - '_': '/tools/buildbot/bin/python'} 17:45:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:45:48 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)) 17:45:48 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)) 17:45:48 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)) 17:45:48 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)) 17:45:48 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)) 17:45:48 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)) 17:45:48 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)) 17:45:48 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)) 17:45:48 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)) 17:45:48 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)) 17:45:48 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)) 17:45:48 INFO - Cleaning up... 17:45:48 INFO - Return code: 0 17:45:48 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 17:45: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')]} 17:45:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:45:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45: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')]} 17:45:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:45:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fbecd284f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23668a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24336d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, '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': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', '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 17:45: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', 'jsonschema'] in /builds/slave/test-pgo/build 17:45: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 jsonschema 17:45:48 INFO - Using env: {'DISPLAY': ':0', 17:45:48 INFO - 'HOME': '/home/cltbld', 17:45:48 INFO - 'LANG': 'en_US.UTF-8', 17:45:48 INFO - 'LANGUAGE': 'en_US:en', 17:45:48 INFO - 'LOGNAME': 'cltbld', 17:45:48 INFO - 'MAIL': '/var/mail/cltbld', 17:45:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:45:48 INFO - 'MOZ_NO_REMOTE': '1', 17:45:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:45:48 INFO - 'NO_EM_RESTART': '1', 17:45:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:45:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:45:48 INFO - 'PWD': '/builds/slave/test-pgo', 17:45:48 INFO - 'SHELL': '/bin/bash', 17:45:48 INFO - 'SHLVL': '1', 17:45:48 INFO - 'TERM': 'linux', 17:45:48 INFO - 'TMOUT': '86400', 17:45:48 INFO - 'USER': 'cltbld', 17:45:48 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:45:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:45:48 INFO - '_': '/tools/buildbot/bin/python'} 17:45:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:45:48 INFO - Downloading/unpacking jsonschema 17:45: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 17:45: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 17:45: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 17:45: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 17:45: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 17:45: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 17:45:52 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 17:45:53 INFO - Downloading/unpacking functools32 (from jsonschema) 17:45:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:53 INFO - Downloading functools32-3.2.3-2.tar.gz 17:45:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 17:45:53 INFO - warning: no files found matching '*.txt' 17:45:53 INFO - no previously-included directories found matching 'build' 17:45:53 INFO - no previously-included directories found matching 'dist' 17:45:53 INFO - no previously-included directories found matching '.git*' 17:45:53 INFO - Installing collected packages: jsonschema, functools32 17:45:53 INFO - Running setup.py install for functools32 17:45:53 INFO - warning: no files found matching '*.txt' 17:45:53 INFO - no previously-included directories found matching 'build' 17:45:53 INFO - no previously-included directories found matching 'dist' 17:45:53 INFO - no previously-included directories found matching '.git*' 17:45:53 INFO - Successfully installed jsonschema functools32 17:45:53 INFO - Cleaning up... 17:45:53 INFO - Return code: 0 17:45:53 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 17:45:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:45:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 17:45:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 17:45:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 17:45:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 17:45:53 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 0x7fbecd284f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23668a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x24336d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, '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': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', '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 17:45:53 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 17:45:53 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 17:45:53 INFO - Using env: {'DISPLAY': ':0', 17:45:53 INFO - 'HOME': '/home/cltbld', 17:45:53 INFO - 'LANG': 'en_US.UTF-8', 17:45:53 INFO - 'LANGUAGE': 'en_US:en', 17:45:53 INFO - 'LOGNAME': 'cltbld', 17:45:53 INFO - 'MAIL': '/var/mail/cltbld', 17:45:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:45:53 INFO - 'MOZ_NO_REMOTE': '1', 17:45:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:45:53 INFO - 'NO_EM_RESTART': '1', 17:45:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:45:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:45:53 INFO - 'PWD': '/builds/slave/test-pgo', 17:45:53 INFO - 'SHELL': '/bin/bash', 17:45:53 INFO - 'SHLVL': '1', 17:45:53 INFO - 'TERM': 'linux', 17:45:53 INFO - 'TMOUT': '86400', 17:45:53 INFO - 'USER': 'cltbld', 17:45:53 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:45:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:45:53 INFO - '_': '/tools/buildbot/bin/python'} 17:45:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 17:45:53 INFO - Downloading/unpacking flake8 17:45:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:57 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 17:45:57 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 17:45:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:57 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 17:45:57 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 17:45:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:57 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 17:45:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 17:45:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 17:45:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 17:45:57 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 17:45:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:45:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:45:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:45:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:45:58 INFO - no previously-included directories found matching 'docs/_build' 17:45:58 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 17:45:58 INFO - Running setup.py install for pep8 17:45:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 17:45:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 17:45:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 17:45:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 17:45:58 INFO - no previously-included directories found matching 'docs/_build' 17:45:58 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 17:45:58 INFO - Successfully installed flake8 mccabe pyflakes pep8 17:45:58 INFO - Cleaning up... 17:45:58 INFO - Return code: 0 17:45:58 INFO - Running post-action listener: _resource_record_post_action 17:45:58 INFO - Running post-action listener: _start_resource_monitoring 17:45:58 INFO - Starting resource monitoring. 17:45:58 INFO - ##### 17:45:58 INFO - ##### Running install step. 17:45:58 INFO - ##### 17:45:58 INFO - Running pre-action listener: _resource_record_pre_action 17:45:58 INFO - Running main action method: install 17:45:58 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 17:45:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 17:45:58 INFO - Reading from file tmpfile_stdout 17:45:58 INFO - Detecting whether we're running mozinstall >=1.0... 17:45:58 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 17:45:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 17:45:58 INFO - Reading from file tmpfile_stdout 17:45:58 INFO - Output received: 17:45:58 INFO - Usage: mozinstall [options] installer 17:45:58 INFO - Options: 17:45:58 INFO - -h, --help show this help message and exit 17:45:58 INFO - -d DEST, --destination=DEST 17:45:58 INFO - Directory to install application into. [default: 17:45:58 INFO - "/builds/slave/test-pgo"] 17:45:58 INFO - --app=APP Application being installed. [default: firefox] 17:45:58 INFO - mkdir: /builds/slave/test-pgo/build/application 17:45:58 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 17:45:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 17:46:13 INFO - Reading from file tmpfile_stdout 17:46:13 INFO - Output received: 17:46:13 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 17:46:13 INFO - Running post-action listener: _resource_record_post_action 17:46:13 INFO - ##### 17:46:13 INFO - ##### Running run-tests step. 17:46:13 INFO - ##### 17:46:13 INFO - Running pre-action listener: _resource_record_pre_action 17:46:13 INFO - Running main action method: run_tests 17:46:13 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 17:46:13 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 17:46:13 INFO - Python 2.7.3 17:46:13 INFO - Return code: 0 17:46:13 INFO - grabbing minidump binary from tooltool 17:46:13 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')]} 17:46:13 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 0x24c2920>, '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 0x24c3820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x24c3cb0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 17:46:13 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 17:46:13 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 17:46:13 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 17:46:13 INFO - Return code: 0 17:46:13 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 17:46:13 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 17:46:13 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 17:46:13 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 17:46:13 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 17:46:13 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 17:46:13 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 17:46:14 INFO - Return code: 0 17:46:14 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-008', '--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 17:46:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-008 --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 17:46:14 INFO - Using env: {'DISPLAY': ':0', 17:46:14 INFO - 'HOME': '/home/cltbld', 17:46:14 INFO - 'LANG': 'en_US.UTF-8', 17:46:14 INFO - 'LANGUAGE': 'en_US:en', 17:46:14 INFO - 'LOGNAME': 'cltbld', 17:46:14 INFO - 'MAIL': '/var/mail/cltbld', 17:46:14 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 17:46:14 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 17:46:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 17:46:14 INFO - 'MOZ_NO_REMOTE': '1', 17:46:14 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 17:46:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 17:46:14 INFO - 'NO_EM_RESTART': '1', 17:46:14 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 17:46:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 17:46:14 INFO - 'PWD': '/builds/slave/test-pgo', 17:46:14 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 17:46:14 INFO - 'SHELL': '/bin/bash', 17:46:14 INFO - 'SHLVL': '1', 17:46:14 INFO - 'TERM': 'linux', 17:46:14 INFO - 'TMOUT': '86400', 17:46:14 INFO - 'USER': 'cltbld', 17:46:14 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392', 17:46:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 17:46:14 INFO - '_': '/tools/buildbot/bin/python'} 17:46:14 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-008', '--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 17:46:15 INFO - mozversion application_buildid: 20160321151327 17:46:15 INFO - mozversion application_changeset: 351882d470a769b8e185deeda24a4ddffb19c105 17:46:15 INFO - mozversion application_display_name: FirefoxDeveloperEdition 17:46:15 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 17:46:15 INFO - mozversion application_name: Firefox 17:46:15 INFO - mozversion application_remotingname: firefox-dev 17:46:15 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 17:46:15 INFO - mozversion application_vendor: Mozilla 17:46:15 INFO - mozversion application_version: 47.0a2 17:46:15 INFO - mozversion platform_buildid: 20160321151327 17:46:15 INFO - mozversion platform_changeset: 351882d470a769b8e185deeda24a4ddffb19c105 17:46:15 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 17:46:15 INFO - mozversion platform_version: 47.0a2 17:46:15 INFO - using testdate: 1458607575 17:46:15 INFO - actual date: 1458607575 17:46:15 INFO - starting webserver on 'localhost:50144' 17:46:15 INFO - SUITE-START | Running 2 tests 17:46:15 INFO - TEST-START | dromaeo_css 17:46:15 INFO - operating with platform_type : linux_ 17:46:15 INFO - Initialising browser for dromaeo_css test... 17:46:15 INFO - TEST-INFO | started process 26572 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpb7k_So/profile http://localhost:50144/getInfo.html) 17:46:18 INFO - PROCESS | 26572 | __metrics Screen width/height:1600/1200 17:46:18 INFO - PROCESS | 26572 | colorDepth:24 17:46:18 INFO - PROCESS | 26572 | Browser inner width/height: 1024/697 17:46:18 INFO - PROCESS | 26572 | __metrics 17:46:19 INFO - PROCESS | 26572 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 17:46:19 INFO - PROCESS | 26572 | 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. 17:46:20 INFO - TEST-INFO | 26572: exit 0 17:46:20 INFO - Browser initialized. 17:46:20 INFO - Running cycle 1/1 for dromaeo_css test... 17:46:20 INFO - TEST-INFO | started process 26660 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpb7k_So/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 17:46:32 INFO - PROCESS | 26660 | RSS: Main: 144584704 17:46:32 INFO - PROCESS | 26660 | 17:47:23 INFO - PROCESS | 26660 | 1458607643238 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] 17:49:31 INFO - PROCESS | 26660 | Cycle 1(1): loaded http://localhost:50144/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50144/tests/dromaeo/cssquery-ext.html) 17:49:32 INFO - PROCESS | 26660 | RSS: Main: 248262656 17:49:32 INFO - PROCESS | 26660 | 17:52:34 INFO - PROCESS | 26660 | Cycle 1(1): loaded http://localhost:50144/tests/dromaeo/cssquery-ext.html (next: http://localhost:50144/tests/dromaeo/cssquery-jquery.html) 17:52:34 INFO - PROCESS | 26660 | RSS: Main: 221069312 17:52:34 INFO - PROCESS | 26660 | 17:55:36 INFO - PROCESS | 26660 | Cycle 1(1): loaded http://localhost:50144/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50144/tests/dromaeo/cssquery-mootools.html) 17:55:37 INFO - PROCESS | 26660 | RSS: Main: 232439808 17:55:37 INFO - PROCESS | 26660 | 17:58:39 INFO - PROCESS | 26660 | Cycle 1(1): loaded http://localhost:50144/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50144/tests/dromaeo/cssquery-prototype.html) 17:58:39 INFO - PROCESS | 26660 | RSS: Main: 205664256 17:58:39 INFO - PROCESS | 26660 | 18:01:42 INFO - PROCESS | 26660 | Cycle 1(1): loaded http://localhost:50144/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50144/tests/dromaeo/cssquery-yui.html) 18:01:42 INFO - PROCESS | 26660 | RSS: Main: 210681856 18:01:42 INFO - PROCESS | 26660 | 18:04:44 INFO - PROCESS | 26660 | Cycle 1(1): loaded http://localhost:50144/tests/dromaeo/cssquery-yui.html (next: http://localhost:50144/tests/dromaeo/cssquery-dojo.html) 18:04:45 INFO - PROCESS | 26660 | RSS: Main: 241336320 18:04:45 INFO - PROCESS | 26660 | 18:04:45 INFO - PROCESS | 26660 | __start_tp_report 18:04:45 INFO - PROCESS | 26660 | _x_x_mozilla_page_load 18:04:45 INFO - PROCESS | 26660 | _x_x_mozilla_page_load_details 18:04:45 INFO - PROCESS | 26660 | |i|pagename|runs| 18:04:45 INFO - PROCESS | 26660 | |0;dojo.html;3290.670932906708;3292.901212963611;3320.086976081577;3325.9002229933094;3376.40912840253;5267;5272.551833094187;5288.762005709752;5302.151655735083;5354.785808567653;5284.365876094865;5289.497497737709;5307.442718514559;5310.0972834618115;5341.519263266306;4742.834000809972;4851;4861.319415281863;4903.166461701501;4936.975315123419;4833.130036593412;4858.4898585648525;4892.266160075999;4939.20972644377;4961.950380496203;4894.192458244385;4914.557689807916;4925.852224433273;4970.428400733907;4992.625553083515;4874.951250487486;4932.2108462646165;4949.851504454836;4956.479569645189;4974.328465657144;4741.241401375763;4795.520447955211;4899.657024008321;4903.803847846082;4904.239842824368;5176.0683077046115;5190.4031036430915;5195.350581177353;5196.324477817897;5215.139501982168;5759.020966435716;5764.452377024176;5778.133280007991;5799.971000145015;5801.477866991991;5686.914696279559;5738.626989245686;5758.856028599319;5820.941790582082;5831.183634291203;5374.8925021499745;5388.407275199725;5390.6226564140525;5391.379991301012;5392.002479541297;5753.59724819267;5784.566157538202;5835.795747148914;5836.037053886062;5841.678707671119;5618.213450116987;5667.716614169275;5670.432956704297;5696.316442026983;5708.172315014383;5822.359540450547;5826.883462330729;5836.066229403275;5838.708064596838;5851;5597.412271711493;5631.521320687787;5802.709864506842;5812.21535092757;5817.650940943557;5757.712114394263;5779.162021506858;5781.1328300754385;5787.479126878517;5812.041013232769;4384.758838263862;4406.140802543473;4415.271480205794;4419.403380543586;4424.867253982386;3886.8833934981994;3942.8422863085157;3988.3818008208773;3988.840446382112;4031.09300407406;5341.198820177005;5356.785728570813;5358.624896257303;5362.973185134049;5383.865403364869;5725.656460612377;5727.341355744143;5727.427257274239;5728.541716662657;5729.914051289234;5162.97418512905;5231.529162375328;5350.277712508761;5389.649672771257;5412.675239485643;4955.083309587666;4960.503949605083;4961.280614310905;4970.527799859007;4970.801167953314;5911.645301281937;5964.701764911737;5968.820935371946;5984.222051133324;6008.3390827009;5610.803621873215;5769;5801.88396232073;5855.2973643163095;5857.58996870215;5964.075568286922;5974.044152935509;5975.760969561169;5975.850603734942;5986.161937328865;5711.942880571307;5715.8571035724435;5722.084466485342;5727;5731.226284451545;5596.552275817843;5722.799702010409;5785.82642520725;5811.854703632443;5815.069588865761;5604.159376093456;5617.494425501724;5623.1846382273525;5634.690092044977;5640.915386269291;5425.83722488326;5644.096944488862;5645.774169033357;5645.915311270416;5647.491725744702;5450.5367043801725;5508.724563771875;5516.062269414129;5523.364813046551;5548.944510555004;5611.887762244651;5613.663180209037;5621.437856214346;5625.46558076982;5626.930883132191;5376.946230537801;5502.0921547944145;5505.449455054462;5530.198121272473;5547.750351234124 18:04:45 INFO - PROCESS | 26660 | |1;ext.html;513.1712284660275;570.8401647538691;573.3492486028357;573.9454751798578;585.4233579923774;29409.117726468212;40796.38805417917;41690.79154604223;41742.373864391986;41822.16355672885;43131.35302970458;44129.7793511032;44175.3373699394;44200.77899610506;44261.336079958826;7529.1341495727875;8671.17623825737;8928.821423571524;10330.380177189356;10535.31520451172;10472;10599.09907657846;10603.310784798963;10614.628488002922;10629.52167152476;10402.21983351248;10451.16390688743;10452.68641940743;10470.534125222475;10497.737556561071;10505.212109091848;10579.100776434012;10581.523831427605;10594;10599.682009539687;10432.739181520446;10579.78840423195;10584.576616935314;10883;10883.074938630147;42627.147457050996;42816.57183428157;43126;43135.56864431347;43179.78410107961;3734.2158146788934;3784.6215378461934;3806.467094606757;3879.4374815651854;4111.198316328318;29377.11868643944;29805.850970745007;29876.103716888527;29983.100506984825;30687.693123068708;4140.296149654536;4190.078182799779;4290.2706539888295;4301.698881078326;4308.78456077198;304303;305129;305806;306841;307683;45461.090778184254;46143;63159.6842015787;64125.67937160378;64207;39145.45554538946;39434.80282598626;39574.20851582952;39576;39611.60388396137;12955.417006234742;13916.443342266399;14403.135811851113;14403.711925761427;14409.639759006108;11111.277766945122;11332.660020199408;11345.09239260857;11350;11358.488868000959;14944.252787360589;15038.774418383733;15046.699066018618;15061.47284845047;15071.246437678072;6001.549883758736;6264.843378915472;6270;6315.147455093595;6338;1056.3292309383596;1103.9558417663204;1111.2554588425774;1116.6761639124563;1162.9882002657741;30492.390152196833;30679.07962761121;32424.189395265308;32705.672943270263;32906;1102.079763397572;1119.2109562758235;1127.4700890581414;1161.8257261410856;1225.3444407242082;15066.54800355991;15105.773413398589;15204;15502.767458488132;15541.611459713598;425451;427713;428844;429251;429792;47966.52033479621;48021.519784801705;48026.519734802205;48057.75971120192;48189.03621927612;1139.8974092331564;1406.4866323791741;1446.5298777897226;1466.413434626158;1495.6784291377405;27976.58035129434;28278;28767.99312024069;28855.855720722102;28933.710662893103;43943.121137577706;44452.55547444484;44662.55337446714;44667.329990049526;44728.55271447374;207409;207490;208464;208669;208669;33725.83137084299;35093.29813403667;46866.53133468622;47454;47643.285350719074;39119.80440097781;39331.2133757329;39430.60569394269;39567.2086558273;40686.59313406828;36962.07594810151;37200;37271.068223294635;37330.75435203117;37421;39258.80370598243;40035.199296013336;40299.59700402959;40485.39271910983;40714;39693.404598930465;40114.598854012256;40649.79675101724;40707.796461017504;41322.79338603288;34774.47838282478;35996.82001589975;36156.830590164675;36294.09264768296;36589;27023.189304320116;27377.452450951267;27528.174154775388;27582;27638.44723105567 18:04:45 INFO - PROCESS | 26660 | |2;jquery.html;369.71716636772874;371.74906937816974;376.51617671292394;377.7393598417092;379.4232766195381;17779.911100444497;18164;19020.239190432367;19097.427077187673;19124.617507649873;17654.735178972292;17703.380381686642;18179.454616361498;18184.181711822966;18201.635967280647;5697.344805347387;5885.999380105392;5914.467697907187;5914.822555323347;5919.260092488439;4289.335153051282;5711.2575365202465;6130.693465326738;6401.071844582532;6413.1662883825275;6300.842478938041;6308.053791931224;6362.618242905417;6368.713407896633;6379.71291291893;6072.2713274406915;6208.937910620881;6255.093011513305;6261.248650161987;6271.592346497463;3822.7706337619834;5392.083345831218;5521.806736764234;5608.074667679828;5609.803656872031;21256.893715531478;21447.356579302646;21467.463313417134;21655.67516487254;21692.240771573077;2324.9883750581307;2663.9334016649545;2851.81463204891;3209.3420848726187;3217.6943190396873;13142.342882855819;13863.098898571661;13981.650458738512;13997.30013499321;14105.294735263298;1846.5660569766094;1884.0956340956418;1987.423647142327;2012.828909542676;2034.491377155711;65699.3430065698;65940;65956.3404365955;66352.99999999952;66946.3305366945;10570.524326405177;10592.205584581186;10628.627998020032;10699.304545204692;11036.613718519813;13735.45058197681;13772.724545509034;13865.4453821846;13879.097858639156;13901.930490347484;7988.600569971478;7989.8402031960195;8057.758267251992;8071.394645401619;8194.50832950025;7611.4291428142005;7634;7637.121731001006;7716.074071111502;7729;6361;6400.103985442041;6407.199100112486;6409.807705768834;6482.448991835652;1682.3775203174903;1736.8089510153873;1800.2438975630266;1818.1272988965106;1862.1806405181676;947.6114792934864;961.5769061613008;979.8040391921644;979.8285300072602;996.9003099690118;16643;16825.326986920387;16985.745213821803;17058.914705426392;17256;1003.1373019203479;1039.7452624107143;1059;1073.8657667791526;1120.9943950280197;9648.469334186688;9792.265580081523;10000.792455820692;10036.799264014824;10116.443595602312;463419;465113;466160;470779;472512;66971.33028669748;70410.2958970414;70440.64779676171;70750.64624676843;71205.64397178084;1059.1685526861377;1075.7471994081384;1079.3416016230094;1086.9565217391216;1090.9127269818396;15506;15526.534203973899;15558.144302063496;16069.956277326672;16120.283959479602;32200.35599288048;32797.836010819796;33117.66882331146;33477.49783753197;33683.47373946915;43079.35380969225;44763.32855007242;45193.32210016918;45444;45529.54470455253;7696.46124771283;8047.718329858427;8691.174338437839;8812.471251724917;8820;9060.592273347847;12988.610341689764;13680.384382702603;13771.311434428038;13777.724445511234;10969.122470202525;11033.944830275797;11287;11383.487743051748;12305.446254918372;11810.940945295219;11859.466324015268;12024.038076953997;12126.454309555915;12187.634370968884;5960.076188190664;8258.958705206436;11802.937735603837;12152.149349545447;12347.073969452507;7922.207779222032;7927.801804954922;8097.676092956216;8145.714899978472;8506.404551681322;11639.883601164218;11993.460294286953;12036;12319.69200769988;12345.197562158432 18:04:45 INFO - PROCESS | 26660 | |3;mootools.html;1313.1005261395937;1577.2902194012693;1594.62526306318;1826.5433641589602;1948.7369205157308;8192.426530142884;8334.74995750127;8342.666293348266;8352.749417517476;8364.37267204959;8058.5970701464985;8207.548584827848;8222.629981650825;8230.300424463927;8231.547264900442;2115.3653903828867;2164.751053628837;2328.860268383902;2383.5232953409345;2412.1798588479915;2367.9052837886466;2368.52629474105;2377.2511658827502;2380.880955952204;2384.4158181245534;2285.3486756274465;2301.4361481436986;2330.3940975346445;2331.1258278145697;2332.0322066342533;2293.1056887813766;2293.7935585797277;2294.105298933417;2404.675368825204;2408.903643854244;2375.5011447596025;2388.617821148608;2397.1969390254285;2421.83047186697;2426.8786560671897;8460.280876125536;8475.23722864939;8529.360297977615;8542.23119919204;8550.40147189697;4933.629977751683;5034.219695947134;5034.395872495324;5036;5040.949590504085;3254.0725893120584;3278.164068162603;3316.4196265653654;3435.1927297085167;3454.896353109411;1033.777737786372;1043.7860238651058;1062.5696592879897;2014.5567975045467;2118.290372725139;11420.885791142066;11535.134864885084;11539.538418463335;11544.191906566544;11550.36472993985;4353.673474489426;4428.247197976351;4531.909361812745;4686.203345431285;4695.107929493385;9147.039560846148;9159.587818548182;9212.677556285498;9212.815743685089;9225.354225204172;5070.492950704974;5073.441921388644;5077.441481437039;5077.517635824591;5078.669886457368;3930.3121953657997;4502.212112880233;4593.311003349524;4598.540145985375;4605.424321959755;3715.294094122108;3763.717721170923;3775.754575952554;3777.206786574795;3821.140243445258;1065.4193464561833;1067.3915867955345;1067.5676351077825;1082.8105081610686;1121.3384103379046;1095.6767753512734;1125.3079356196045;1126.6056880091903;1139.5100106953923;1147.363213416545;8127.268545830903;8232.670693172206;8255.215754503313;8291.33669306454;8305.837182794414;478.4736789531557;480.7524125075589;483.39334135660226;488.9902201955941;491.09148076059006;6335.176427064452;6377;6381.968090159612;6386.584871983307;6425.228972523327;9739.610415583298;9968.950155249177;10102.595896164217;10119.392836429837;10129.848052279222;10154.949225253826;10369.274150809522;10423.218258630633;10517.31637443579;10531.52608132636;7895.210478952059;7992.760217193493;8018.5990700464745;8018.639161237758;8103.351731861555;7978.920210797818;8092.473989190684;8111.229433203836;8130.308923741548;8167.509949403055;9202.263818894606;9273.86089208676;9282.071792820663;9388.061193880558;9469.337146399686;9381.155695987394;9456.196223321094;9611.231101512001;9684.612615495584;9819.312648114563;6562.048502967138;6729.259781423942;7442.106947166375;7554.131274903457;7667.578283194478;7988.520688758693;8033.0360356757565;8097.838043238984;8114.837703245784;8117.188281171835;6983.755568555076;7161.713531458683;7240.420766338575;7281.672324745505;7304.780856574312;6950.3049695030095;7035;7066.434685225273;7089.291070892869;7162.713491460491;7354.816129596803;7418.703251870081;7424.331810137113;7424.443166762622;7578.355839753683;7042.542234754725;7111.751088711871;7123.893141602776;7130.714771409085;7133.964330178316;6854.451643868579;7053.506254562131;7073.82315442118;7080.964595176991;7083.82290442743 18:04:45 INFO - PROCESS | 26660 | |4;prototype.html;309.2038002144477;317.5348115011508;322.83696733149753;332.20271348762964;334.2846308898956;6077.574569780111;6123.081537769332;6132.754689812402;6139.539534534916;6158.107074474198;6030.216071910657;6030.487408570277;6032.909506357408;6033.6379817211;6037.184980027695;4398.296272596385;4508.66185036122;4523.819047238107;4635.976820115895;4645.953540464594;4609.654275929319;4646.25659894417;4658.557437043492;4658.930116048262;4664.3936288282475;4593.609543188833;4594.035252596958;4597.977010114945;4598.0344127733215;4615.561521655454;4347.760873151976;4482.798274077674;4597.149527337453;4626.44482662081;4637.628989680834;3986.900327491807;4002.8799136025673;4005.359142537209;4011.578784227643;4023.295923213426;5758.452946970031;5758.856028599276;5762.30852297727;5769.365369809318;5776.855578610526;5376.569874410038;5376.946230537684;5377.166539186433;5377.166539186433;5385.8114965976;6365.936340636581;6368.840778980516;6373.840653983688;6376.553641245115;6381.074744162117;4250.511191212988;4375.518692943805;4456.8885777855485;4476.395686582302;4480.103979204139;6617.536772425932;6638.601683898982;6663.900041499382;6666.766663166814;6667.499937504706;4381.956180438218;4386.0569977455;4387.605115539617;4391.67062470316;4398.3842262083335;4447.666425018137;4448.7108337957925;4450.1767173073085;4453.4433195850515;4463.732176069446;5199.792008319625;5202.947970520322;5206.167013277857;5207.479252074762;5210.557102646318;6295.811125666238;6412.871742565123;6439.034144878306;6445.677716114269;6461.386168314003;1582.2326171806665;1607.509709538602;1607.7990251218598;1607.9758803617956;1608.8149862765697;953.8521529162991;1005.4369553050169;1005.6832097889142;1021.7292417509366;1025.9281850270409;6122.571420000646;6156.815295541141;6157.876842463215;6161;6167.969160154171;6693.665316734144;6716.361945615159;6718.260991290954;6720.4287635550545;6726.932730672728;6241.063840423973;6242.843928901723;6248.750049997949;6250.062490626351;6250.312465628777;3577.8211089445945;3614.4578313253223;3614.7831130132276;3617.6744093031753;3622.836972336251;6762.391384775394;6960.582365058011;6962.860742785116;6964.686589103502;6971.477139214478;6872.587644741331;6889.655517224119;6892.414144797648;6894.379505844498;6894.586324820527;6944.583325000516;6946.8610627788175;6947.409470194989;6947.548409353376;6949.478789090838;6690.899636505554;6696.363845434676;6697.732090716317;6698.39714425704;6708.563943343667;6385.680715964276;6569.37590928861;6605.603663780189;6620.040094186413;6620.073189753342;6938.548994315353;6947.4789390796905;6963.7562685305775;6964.0598519201285;6975.7209711612995;4608.193566125848;4630.745309008037;4636.44362676481;4638.026014536985;4646.047560250073;6737.383028073129;6738.966305168443;6740.898886516608;6741.325867413219;6741.966290168518;6401.0398440232475;6532.771353002812;6540.444062254762;6543.280239173782;6546.901796473152;6508.544401891822;6549.115869357575;6549.24683661385;6554.115194448879;6557.475401967927;6438.742450301936;6442.516811239269;6444.194475690539;6449.838754031187;6454.903176452263;6505.577137486048;6536.477081833346;6565.474762019123;6567.9671601643595;6570.704318305592;6031.125486804476;6167.444929956326;6400.263969643551;6400.807975760735;6403.263624683221 18:04:45 INFO - PROCESS | 26660 | |5;yui.html;805.4321703199245;805.673702150629;852.2287329966383;899.7975455522509;906.7778394293399;17036.23336949837;17124.315027398905;17237.569060773472;17251.482455526322;17269.82730172698;15850.445234416798;15971.680566388664;15972.361105555763;15975.281112349943;15979.520614381587;588.2147333310036;927.350854401918;934.9859752103741;945.5697657565826;946.9384490008161;939.3330735178032;942.4910548303908;945.461087180304;945.5886689290146;945.650109459501;987.5407935310079;987.7283746969605;988.0613417253602;988.5008070924173;989.2531138990089;619.3775255867846;976.7899901521172;984.0946329376991;986.8963758805294;987.5013118375247;716.9605671688055;722.5303552690793;723.3815088099705;723.4031923662999;723.8154270660948;15257.23713814316;15276.847231527654;15300.464483743126;15307.617309567238;15355.155466449341;13839.131717218148;13900.791488127687;13902.096363736326;14028.859711402858;14549.418023279057;11412.71468213293;11554.768904621944;11585.478653460614;11668.1832271741;11902.404879755977;3987.9601203987877;4015.31739604268;4059.5737447567876;4073.8981525461804;4153.7507749534825;54779;54949;55027.724861375835;55361;55820.16269755957;11269;11326.943365283121;11345.94327028376;11554;11833.11251656112;19551.608967820564;19730.60538789245;19754.60490790176;19783.604327913363;19787.802121978882;8779.429337093068;8867.423617464845;8983.865242021375;8983.955080224558;9000.50497222646;4680.438347398334;4727.125481785881;4964.329815474937;4967.925481117786;4972.65191436596;3350.6314305426386;3380.0366895435177;3387.0516255448515;3388.1360253135294;3394.711449526818;602.6444397805228;604.5888795619021;610.3131064245905;627.7363507326934;628.4626644219218;580.2456806151986;588.8792797476507;641.0672471553878;653.9149910511603;663.4062514049898;9093.954530227307;9132.589033493376;9132.863007054899;9362.391444556082;9555.808883822285;599.5593238969354;715.2882881532804;747.1258627405948;747.4730315127822;748.8577170337618;4306.336197291195;4366.8034938427845;4384.956150438455;4428.955710442919;4435.578620031092;60096.69951650301;60675.69662151661;61430.69284653548;61632.69183654053;61653.691731541956;54419.72790136024;54761.45238547563;55001.72499137479;55608;56554.43445565574;48441;48558.75720621374;48683.26975095376;49061.509384905694;49229.50770492249;9174.449533028039;9342.673006444742;9416.775819143468;9646.565904534453;9659.71020869375;34735.478967815;35874.4618830723;36359;36684.81657591695;37366.62633373631;42709;45784.31323530083;46411.303830441895;46492;47102.05795884132;12343.259404435763;12413.813792793297;12568.975477599388;12653.936730316289;12667.619971400873;11635.53457861676;13391.196528208338;13708.3831227593;14141.505047323295;14234.288285585471;11864.406779661154;11887.881121188677;12435.875641243472;12543.93376562966;12773.48906043785;12260.693482663004;12593.811092833797;12734.745305094031;12783;13405;12493.812592810933;12585.622431327074;12838.955728945351;13116.606501804961;13209.603711888658;10584.89415105839;10683.839742403714;11037.944810275898;11329.773404532029;11488.310701357945;10723.839142412715;11066.649498321287;11133.665990020312;11178.776424471302;11264.267822591506 18:04:45 INFO - PROCESS | 26660 | __end_tp_report 18:04:45 INFO - PROCESS | 26660 | __start_cc_report 18:04:45 INFO - PROCESS | 26660 | _x_x_mozilla_cycle_collect,792 18:04:45 INFO - PROCESS | 26660 | __end_cc_report 18:04:45 INFO - PROCESS | 26660 | __startTimestamp1458608685148__endTimestamp 18:04:45 INFO - PROCESS | 26660 | 18:04:45 INFO - PROCESS | 26660 | ------- Summary: start ------- 18:04:45 INFO - PROCESS | 26660 | Number of tests: 6 18:04:45 INFO - PROCESS | 26660 | 18:04:45 INFO - PROCESS | 26660 | [#0] dojo.html Cycles:165 Average:5337.79 Median:5523.36 stddev:581.49 (10.5%) stddev-sans-first:560.66 18:04:45 INFO - PROCESS | 26660 | Values: 3290.7 3292.9 3320.1 3325.9 3376.4 5267.0 5272.6 5288.8 5302.2 5354.8 5284.4 5289.5 5307.4 5310.1 5341.5 4742.8 4851.0 4861.3 4903.2 4937.0 4833.1 4858.5 4892.3 4939.2 4962.0 4894.2 4914.6 4925.9 4970.4 4992.6 4875.0 4932.2 4949.9 4956.5 4974.3 4741.2 4795.5 4899.7 4903.8 4904.2 5176.1 5190.4 5195.4 5196.3 5215.1 5759.0 5764.5 5778.1 5800.0 5801.5 5686.9 5738.6 5758.9 5820.9 5831.2 5374.9 5388.4 5390.6 5391.4 5392.0 5753.6 5784.6 5835.8 5836.0 5841.7 5618.2 5667.7 5670.4 5696.3 5708.2 5822.4 5826.9 5836.1 5838.7 5851.0 5597.4 5631.5 5802.7 5812.2 5817.7 5757.7 5779.2 5781.1 5787.5 5812.0 4384.8 4406.1 4415.3 4419.4 4424.9 3886.9 3942.8 3988.4 3988.8 4031.1 5341.2 5356.8 5358.6 5363.0 5383.9 5725.7 5727.3 5727.4 5728.5 5729.9 5163.0 5231.5 5350.3 5389.6 5412.7 4955.1 4960.5 4961.3 4970.5 4970.8 5911.6 5964.7 5968.8 5984.2 6008.3 5610.8 5769.0 5801.9 5855.3 5857.6 5964.1 5974.0 5975.8 5975.9 5986.2 5711.9 5715.9 5722.1 5727.0 5731.2 5596.6 5722.8 5785.8 5811.9 5815.1 5604.2 5617.5 5623.2 5634.7 5640.9 5425.8 5644.1 5645.8 5645.9 5647.5 5450.5 5508.7 5516.1 5523.4 5548.9 5611.9 5613.7 5621.4 5625.5 5626.9 5376.9 5502.1 5505.4 5530.2 5547.8 18:04:45 INFO - PROCESS | 26660 | 18:04:45 INFO - PROCESS | 26660 | [#1] ext.html Cycles:180 Average:48224.34 Median:35545.06 stddev:86074.44 (242.2%) stddev-sans-first:86241.36 18:04:45 INFO - PROCESS | 26660 | Values: 513.2 570.8 573.3 573.9 585.4 29409.1 40796.4 41690.8 41742.4 41822.2 43131.4 44129.8 44175.3 44200.8 44261.3 7529.1 8671.2 8928.8 10330.4 10535.3 10472.0 10599.1 10603.3 10614.6 10629.5 10402.2 10451.2 10452.7 10470.5 10497.7 10505.2 10579.1 10581.5 10594.0 10599.7 10432.7 10579.8 10584.6 10883.0 10883.1 42627.1 42816.6 43126.0 43135.6 43179.8 3734.2 3784.6 3806.5 3879.4 4111.2 29377.1 29805.9 29876.1 29983.1 30687.7 4140.3 4190.1 4290.3 4301.7 4308.8 304303.0 305129.0 305806.0 306841.0 307683.0 45461.1 46143.0 63159.7 64125.7 64207.0 39145.5 39434.8 39574.2 39576.0 39611.6 12955.4 13916.4 14403.1 14403.7 14409.6 11111.3 11332.7 11345.1 11350.0 11358.5 14944.3 15038.8 15046.7 15061.5 15071.2 6001.5 6264.8 6270.0 6315.1 6338.0 1056.3 1104.0 1111.3 1116.7 1163.0 30492.4 30679.1 32424.2 32705.7 32906.0 1102.1 1119.2 1127.5 1161.8 1225.3 15066.5 15105.8 15204.0 15502.8 15541.6 425451.0 427713.0 428844.0 429251.0 429792.0 47966.5 48021.5 48026.5 48057.8 48189.0 1139.9 1406.5 1446.5 1466.4 1495.7 27976.6 28278.0 28768.0 28855.9 28933.7 43943.1 44452.6 44662.6 44667.3 44728.6 207409.0 207490.0 208464.0 208669.0 208669.0 33725.8 35093.3 46866.5 47454.0 47643.3 39119.8 39331.2 39430.6 39567.2 40686.6 36962.1 37200.0 37271.1 37330.8 37421.0 39258.8 40035.2 40299.6 40485.4 40714.0 39693.4 40114.6 40649.8 40707.8 41322.8 34774.5 35996.8 36156.8 36294.1 36589.0 27023.2 27377.5 27528.2 27582.0 27638.4 18:04:45 INFO - PROCESS | 26660 | 18:04:45 INFO - PROCESS | 26660 | [#2] jquery.html Cycles:180 Average:26585.29 Median:32499.10 stddev:76414.70 (235.1%) stddev-sans-first:76603.71 18:04:45 INFO - PROCESS | 26660 | Values: 369.7 371.7 376.5 377.7 379.4 17779.9 18164.0 19020.2 19097.4 19124.6 17654.7 17703.4 18179.5 18184.2 18201.6 5697.3 5886.0 5914.5 5914.8 5919.3 4289.3 5711.3 6130.7 6401.1 6413.2 6300.8 6308.1 6362.6 6368.7 6379.7 6072.3 6208.9 6255.1 6261.2 6271.6 3822.8 5392.1 5521.8 5608.1 5609.8 21256.9 21447.4 21467.5 21655.7 21692.2 2325.0 2663.9 2851.8 3209.3 3217.7 13142.3 13863.1 13981.7 13997.3 14105.3 1846.6 1884.1 1987.4 2012.8 2034.5 65699.3 65940.0 65956.3 66353.0 66946.3 10570.5 10592.2 10628.6 10699.3 11036.6 13735.5 13772.7 13865.4 13879.1 13901.9 7988.6 7989.8 8057.8 8071.4 8194.5 7611.4 7634.0 7637.1 7716.1 7729.0 6361.0 6400.1 6407.2 6409.8 6482.4 1682.4 1736.8 1800.2 1818.1 1862.2 947.6 961.6 979.8 979.8 996.9 16643.0 16825.3 16985.7 17058.9 17256.0 1003.1 1039.7 1059.0 1073.9 1121.0 9648.5 9792.3 10000.8 10036.8 10116.4 463419.0 465113.0 466160.0 470779.0 472512.0 66971.3 70410.3 70440.6 70750.6 71205.6 1059.2 1075.7 1079.3 1087.0 1090.9 15506.0 15526.5 15558.1 16070.0 16120.3 32200.4 32797.8 33117.7 33477.5 33683.5 43079.4 44763.3 45193.3 45444.0 45529.5 7696.5 8047.7 8691.2 8812.5 8820.0 9060.6 12988.6 13680.4 13771.3 13777.7 10969.1 11033.9 11287.0 11383.5 12305.4 11810.9 11859.5 12024.0 12126.5 12187.6 5960.1 8259.0 11802.9 12152.1 12347.1 7922.2 7927.8 8097.7 8145.7 8506.4 11639.9 11993.5 12036.0 12319.7 12345.2 18:04:45 INFO - PROCESS | 26660 | 18:04:45 INFO - PROCESS | 26660 | [#3] mootools.html Cycles:180 Average:5849.47 Median:5077.48 stddev:3108.10 (61.2%) stddev-sans-first:3098.11 18:04:45 INFO - PROCESS | 26660 | Values: 1313.1 1577.3 1594.6 1826.5 1948.7 8192.4 8334.7 8342.7 8352.7 8364.4 8058.6 8207.5 8222.6 8230.3 8231.5 2115.4 2164.8 2328.9 2383.5 2412.2 2367.9 2368.5 2377.3 2380.9 2384.4 2285.3 2301.4 2330.4 2331.1 2332.0 2293.1 2293.8 2294.1 2404.7 2408.9 2375.5 2388.6 2397.2 2421.8 2426.9 8460.3 8475.2 8529.4 8542.2 8550.4 4933.6 5034.2 5034.4 5036.0 5040.9 3254.1 3278.2 3316.4 3435.2 3454.9 1033.8 1043.8 1062.6 2014.6 2118.3 11420.9 11535.1 11539.5 11544.2 11550.4 4353.7 4428.2 4531.9 4686.2 4695.1 9147.0 9159.6 9212.7 9212.8 9225.4 5070.5 5073.4 5077.4 5077.5 5078.7 3930.3 4502.2 4593.3 4598.5 4605.4 3715.3 3763.7 3775.8 3777.2 3821.1 1065.4 1067.4 1067.6 1082.8 1121.3 1095.7 1125.3 1126.6 1139.5 1147.4 8127.3 8232.7 8255.2 8291.3 8305.8 478.5 480.8 483.4 489.0 491.1 6335.2 6377.0 6382.0 6386.6 6425.2 9739.6 9969.0 10102.6 10119.4 10129.8 10154.9 10369.3 10423.2 10517.3 10531.5 7895.2 7992.8 8018.6 8018.6 8103.4 7978.9 8092.5 8111.2 8130.3 8167.5 9202.3 9273.9 9282.1 9388.1 9469.3 9381.2 9456.2 9611.2 9684.6 9819.3 6562.0 6729.3 7442.1 7554.1 7667.6 7988.5 8033.0 8097.8 8114.8 8117.2 6983.8 7161.7 7240.4 7281.7 7304.8 6950.3 7035.0 7066.4 7089.3 7162.7 7354.8 7418.7 7424.3 7424.4 7578.4 7042.5 7111.8 7123.9 7130.7 7134.0 6854.5 7053.5 7073.8 7081.0 7083.8 18:04:45 INFO - PROCESS | 26660 | 18:04:45 INFO - PROCESS | 26660 | [#4] prototype.html Cycles:180 Average:5385.05 Median:6157.35 stddev:1658.72 (26.9%) stddev-sans-first:1619.03 18:04:45 INFO - PROCESS | 26660 | Values: 309.2 317.5 322.8 332.2 334.3 6077.6 6123.1 6132.8 6139.5 6158.1 6030.2 6030.5 6032.9 6033.6 6037.2 4398.3 4508.7 4523.8 4636.0 4646.0 4609.7 4646.3 4658.6 4658.9 4664.4 4593.6 4594.0 4598.0 4598.0 4615.6 4347.8 4482.8 4597.1 4626.4 4637.6 3986.9 4002.9 4005.4 4011.6 4023.3 5758.5 5758.9 5762.3 5769.4 5776.9 5376.6 5376.9 5377.2 5377.2 5385.8 6365.9 6368.8 6373.8 6376.6 6381.1 4250.5 4375.5 4456.9 4476.4 4480.1 6617.5 6638.6 6663.9 6666.8 6667.5 4382.0 4386.1 4387.6 4391.7 4398.4 4447.7 4448.7 4450.2 4453.4 4463.7 5199.8 5202.9 5206.2 5207.5 5210.6 6295.8 6412.9 6439.0 6445.7 6461.4 1582.2 1607.5 1607.8 1608.0 1608.8 953.9 1005.4 1005.7 1021.7 1025.9 6122.6 6156.8 6157.9 6161.0 6168.0 6693.7 6716.4 6718.3 6720.4 6726.9 6241.1 6242.8 6248.8 6250.1 6250.3 3577.8 3614.5 3614.8 3617.7 3622.8 6762.4 6960.6 6962.9 6964.7 6971.5 6872.6 6889.7 6892.4 6894.4 6894.6 6944.6 6946.9 6947.4 6947.5 6949.5 6690.9 6696.4 6697.7 6698.4 6708.6 6385.7 6569.4 6605.6 6620.0 6620.1 6938.5 6947.5 6963.8 6964.1 6975.7 4608.2 4630.7 4636.4 4638.0 4646.0 6737.4 6739.0 6740.9 6741.3 6742.0 6401.0 6532.8 6540.4 6543.3 6546.9 6508.5 6549.1 6549.2 6554.1 6557.5 6438.7 6442.5 6444.2 6449.8 6454.9 6505.6 6536.5 6565.5 6568.0 6570.7 6031.1 6167.4 6400.3 6400.8 6403.3 18:04:45 INFO - PROCESS | 26660 | 18:04:45 INFO - PROCESS | 26660 | [#5] yui.html Cycles:180 Average:15140.25 Median:25109.95 stddev:17040.49 (67.9%) stddev-sans-first:17054.29 18:04:45 INFO - PROCESS | 26660 | Values: 805.4 805.7 852.2 899.8 906.8 17036.2 17124.3 17237.6 17251.5 17269.8 15850.4 15971.7 15972.4 15975.3 15979.5 588.2 927.4 935.0 945.6 946.9 939.3 942.5 945.5 945.6 945.7 987.5 987.7 988.1 988.5 989.3 619.4 976.8 984.1 986.9 987.5 717.0 722.5 723.4 723.4 723.8 15257.2 15276.8 15300.5 15307.6 15355.2 13839.1 13900.8 13902.1 14028.9 14549.4 11412.7 11554.8 11585.5 11668.2 11902.4 3988.0 4015.3 4059.6 4073.9 4153.8 54779.0 54949.0 55027.7 55361.0 55820.2 11269.0 11326.9 11345.9 11554.0 11833.1 19551.6 19730.6 19754.6 19783.6 19787.8 8779.4 8867.4 8983.9 8984.0 9000.5 4680.4 4727.1 4964.3 4967.9 4972.7 3350.6 3380.0 3387.1 3388.1 3394.7 602.6 604.6 610.3 627.7 628.5 580.2 588.9 641.1 653.9 663.4 9094.0 9132.6 9132.9 9362.4 9555.8 599.6 715.3 747.1 747.5 748.9 4306.3 4366.8 4385.0 4429.0 4435.6 60096.7 60675.7 61430.7 61632.7 61653.7 54419.7 54761.5 55001.7 55608.0 56554.4 48441.0 48558.8 48683.3 49061.5 49229.5 9174.4 9342.7 9416.8 9646.6 9659.7 34735.5 35874.5 36359.0 36684.8 37366.6 42709.0 45784.3 46411.3 46492.0 47102.1 12343.3 12413.8 12569.0 12653.9 12667.6 11635.5 13391.2 13708.4 14141.5 14234.3 11864.4 11887.9 12435.9 12543.9 12773.5 12260.7 12593.8 12734.7 12783.0 13405.0 12493.8 12585.6 12839.0 13116.6 13209.6 10584.9 10683.8 11037.9 11329.8 11488.3 10723.8 11066.6 11133.7 11178.8 11264.3 18:04:45 INFO - PROCESS | 26660 | -------- Summary: end -------- 18:04:45 INFO - PROCESS | 26660 | 18:04:45 INFO - TEST-INFO | 26660: exit 0 18:04:45 INFO - TEST-OK | dromaeo_css | took 1110759ms 18:04:45 INFO - TEST-START | kraken 18:04:45 INFO - operating with platform_type : linux_ 18:04:45 INFO - Initialising browser for kraken test... 18:04:45 INFO - TEST-INFO | started process 26848 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpp5XDkw/profile http://localhost:50144/getInfo.html) 18:04:49 INFO - PROCESS | 26848 | __metrics Screen width/height:1600/1200 18:04:49 INFO - PROCESS | 26848 | colorDepth:24 18:04:49 INFO - PROCESS | 26848 | Browser inner width/height: 1024/697 18:04:49 INFO - PROCESS | 26848 | __metrics 18:04:50 INFO - PROCESS | 26848 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 18:04:51 INFO - TEST-INFO | 26848: exit 0 18:04:51 INFO - Browser initialized. 18:04:51 INFO - Running cycle 1/1 for kraken test... 18:04:51 INFO - TEST-INFO | started process 26938 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpp5XDkw/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:05:03 INFO - PROCESS | 26938 | RSS: Main: 144707584 18:05:03 INFO - PROCESS | 26938 | 18:05:05 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50144/tests/kraken/driver.html?testName=audio-beat-detection) 18:05:06 INFO - PROCESS | 26938 | RSS: Main: 179572736 18:05:06 INFO - PROCESS | 26938 | 18:05:09 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50144/tests/kraken/driver.html?testName=audio-dft) 18:05:09 INFO - PROCESS | 26938 | RSS: Main: 177471488 18:05:09 INFO - PROCESS | 26938 | 18:05:12 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50144/tests/kraken/driver.html?testName=audio-fft) 18:05:13 INFO - PROCESS | 26938 | RSS: Main: 174039040 18:05:13 INFO - PROCESS | 26938 | 18:05:15 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50144/tests/kraken/driver.html?testName=audio-oscillator) 18:05:15 INFO - PROCESS | 26938 | RSS: Main: 174850048 18:05:15 INFO - PROCESS | 26938 | 18:05:17 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50144/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:05:18 INFO - PROCESS | 26938 | RSS: Main: 172531712 18:05:18 INFO - PROCESS | 26938 | 18:05:21 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50144/tests/kraken/driver.html?testName=imaging-darkroom) 18:05:22 INFO - PROCESS | 26938 | RSS: Main: 171692032 18:05:22 INFO - PROCESS | 26938 | 18:05:25 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50144/tests/kraken/driver.html?testName=imaging-desaturate) 18:05:25 INFO - PROCESS | 26938 | RSS: Main: 174231552 18:05:25 INFO - PROCESS | 26938 | 18:05:28 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50144/tests/kraken/driver.html?testName=json-parse-financial) 18:05:29 INFO - PROCESS | 26938 | RSS: Main: 173834240 18:05:29 INFO - PROCESS | 26938 | 18:05:30 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50144/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:05:31 INFO - PROCESS | 26938 | RSS: Main: 178626560 18:05:31 INFO - PROCESS | 26938 | 18:05:33 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50144/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:05:33 INFO - PROCESS | 26938 | RSS: Main: 176709632 18:05:33 INFO - PROCESS | 26938 | 18:05:35 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50144/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:05:36 INFO - PROCESS | 26938 | RSS: Main: 182140928 18:05:36 INFO - PROCESS | 26938 | 18:05:38 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50144/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:05:39 INFO - PROCESS | 26938 | RSS: Main: 189136896 18:05:39 INFO - PROCESS | 26938 | 18:05:41 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50144/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:05:42 INFO - PROCESS | 26938 | RSS: Main: 186368000 18:05:42 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | Cycle 1(1): loaded http://localhost:50144/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50144/tests/kraken/driver.html?testName=ai-astar) 18:05:44 INFO - PROCESS | 26938 | RSS: Main: 248639488 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | __start_tp_report 18:05:44 INFO - PROCESS | 26938 | _x_x_mozilla_page_load 18:05:44 INFO - PROCESS | 26938 | _x_x_mozilla_page_load_details 18:05:44 INFO - PROCESS | 26938 | |i|pagename|runs| 18:05:44 INFO - PROCESS | 26938 | |0;ai-astar;111;110;104;109;110;110;100;109;111;109 18:05:44 INFO - PROCESS | 26938 | |1;audio-beat-detection;151;124;148;161;125;157;158;125;175;125 18:05:44 INFO - PROCESS | 26938 | |2;audio-dft;159;160;161;161;161;162;159;162;162;160 18:05:44 INFO - PROCESS | 26938 | |3;audio-fft;76;75;74;161;73;75;74;75;166;76 18:05:44 INFO - PROCESS | 26938 | |4;audio-oscillator;93;93;147;92;93;93;137;92;92;144 18:05:44 INFO - PROCESS | 26938 | |5;imaging-gaussian-blur;117;117;117;117;116;117;116;116;117;117 18:05:44 INFO - PROCESS | 26938 | |6;imaging-darkroom;146;145;145;146;146;146;145;145;146;145 18:05:44 INFO - PROCESS | 26938 | |7;imaging-desaturate;95;95;95;95;96;96;95;95;95;95 18:05:44 INFO - PROCESS | 26938 | |8;json-parse-financial;56;56;57;57;59;59;57;67;53;55 18:05:44 INFO - PROCESS | 26938 | |9;json-stringify-tinderbox;63;63;63;63;64;67;63;63;65;63 18:05:44 INFO - PROCESS | 26938 | |10;stanford-crypto-aes;77;83;77;77;78;79;77;78;77;78 18:05:44 INFO - PROCESS | 26938 | |11;stanford-crypto-ccm;117;110;110;111;127;109;118;113;111;122 18:05:44 INFO - PROCESS | 26938 | |12;stanford-crypto-pbkdf2;147;134;145;147;149;146;144;144;146;148 18:05:44 INFO - PROCESS | 26938 | |13;stanford-crypto-sha256-iterative;67;67;68;65;69;67;67;67;67;68 18:05:44 INFO - PROCESS | 26938 | __end_tp_report 18:05:44 INFO - PROCESS | 26938 | __start_cc_report 18:05:44 INFO - PROCESS | 26938 | _x_x_mozilla_cycle_collect,1064 18:05:44 INFO - PROCESS | 26938 | __end_cc_report 18:05:44 INFO - PROCESS | 26938 | __startTimestamp1458608744313__endTimestamp 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | ------- Summary: start ------- 18:05:44 INFO - PROCESS | 26938 | Number of tests: 14 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#0] ai-astar Cycles:10 Average:108.30 Median:110.00 stddev:3.53 (3.2%) stddev-sans-first:3.61 18:05:44 INFO - PROCESS | 26938 | Values: 111.0 110.0 104.0 109.0 110.0 110.0 100.0 109.0 111.0 109.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#1] audio-beat-detection Cycles:10 Average:144.90 Median:154.00 stddev:18.72 (12.2%) stddev-sans-first:19.73 18:05:44 INFO - PROCESS | 26938 | Values: 151.0 124.0 148.0 161.0 125.0 157.0 158.0 125.0 175.0 125.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#2] audio-dft Cycles:10 Average:160.70 Median:161.00 stddev:1.16 (0.7%) stddev-sans-first:1.05 18:05:44 INFO - PROCESS | 26938 | Values: 159.0 160.0 161.0 161.0 161.0 162.0 159.0 162.0 162.0 160.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#3] audio-fft Cycles:10 Average:92.50 Median:75.00 stddev:37.45 (49.9%) stddev-sans-first:39.24 18:05:44 INFO - PROCESS | 26938 | Values: 76.0 75.0 74.0 161.0 73.0 75.0 74.0 75.0 166.0 76.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#4] audio-oscillator Cycles:10 Average:107.60 Median:92.50 stddev:24.32 (26.3%) stddev-sans-first:25.22 18:05:44 INFO - PROCESS | 26938 | Values: 93.0 93.0 147.0 92.0 93.0 93.0 137.0 92.0 92.0 144.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 18:05:44 INFO - PROCESS | 26938 | Values: 117.0 117.0 117.0 117.0 116.0 117.0 116.0 116.0 117.0 117.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#6] imaging-darkroom Cycles:10 Average:145.50 Median:146.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 18:05:44 INFO - PROCESS | 26938 | Values: 146.0 145.0 145.0 146.0 146.0 146.0 145.0 145.0 146.0 145.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 18:05:44 INFO - PROCESS | 26938 | Values: 95.0 95.0 95.0 95.0 96.0 96.0 95.0 95.0 95.0 95.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#8] json-parse-financial Cycles:10 Average:57.60 Median:57.00 stddev:3.75 (6.6%) stddev-sans-first:3.93 18:05:44 INFO - PROCESS | 26938 | Values: 56.0 56.0 57.0 57.0 59.0 59.0 57.0 67.0 53.0 55.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#9] json-stringify-tinderbox Cycles:10 Average:63.70 Median:63.00 stddev:1.34 (2.1%) stddev-sans-first:1.39 18:05:44 INFO - PROCESS | 26938 | Values: 63.0 63.0 63.0 63.0 64.0 67.0 63.0 63.0 65.0 63.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#10] stanford-crypto-aes Cycles:10 Average:78.10 Median:78.00 stddev:1.85 (2.4%) stddev-sans-first:1.92 18:05:44 INFO - PROCESS | 26938 | Values: 77.0 83.0 77.0 77.0 78.0 79.0 77.0 78.0 77.0 78.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#11] stanford-crypto-ccm Cycles:10 Average:114.80 Median:115.00 stddev:6.03 (5.2%) stddev-sans-first:6.35 18:05:44 INFO - PROCESS | 26938 | Values: 117.0 110.0 110.0 111.0 127.0 109.0 118.0 113.0 111.0 122.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.00 Median:146.50 stddev:4.19 (2.9%) stddev-sans-first:4.38 18:05:44 INFO - PROCESS | 26938 | Values: 147.0 134.0 145.0 147.0 149.0 146.0 144.0 144.0 146.0 148.0 18:05:44 INFO - PROCESS | 26938 | 18:05:44 INFO - PROCESS | 26938 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.20 Median:67.00 stddev:1.03 (1.5%) stddev-sans-first:1.09 18:05:44 INFO - PROCESS | 26938 | Values: 67.0 67.0 68.0 65.0 69.0 67.0 67.0 67.0 67.0 68.0 18:05:44 INFO - PROCESS | 26938 | -------- Summary: end -------- 18:05:44 INFO - PROCESS | 26938 | 18:05:45 INFO - TEST-INFO | 26938: exit 0 18:05:45 INFO - TEST-OK | kraken | took 59457ms 18:05:45 INFO - SUITE-END | took 1170s 18:05:45 INFO - Completed test suite (00:19:30) 18:05:45 INFO - javascript benchmark 18:05:45 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3290.670932906708, 3292.901212963611, 3320.086976081577, 3325.9002229933094, 3376.40912840253, 5267.0, 5272.551833094187, 5288.762005709752, 5302.151655735083, 5354.785808567653, 5284.365876094865, 5289.497497737709, 5307.442718514559, 5310.0972834618115, 5341.519263266306, 4742.834000809972, 4851.0, 4861.319415281863, 4903.166461701501, 4936.975315123419, 4833.130036593412, 4858.4898585648525, 4892.266160075999, 4939.20972644377, 4961.950380496203, 4894.192458244385, 4914.557689807916, 4925.852224433273, 4970.428400733907, 4992.625553083515, 4874.951250487486, 4932.2108462646165, 4949.851504454836, 4956.479569645189, 4974.328465657144, 4741.241401375763, 4795.520447955211, 4899.657024008321, 4903.803847846082, 4904.239842824368, 5176.0683077046115, 5190.4031036430915, 5195.350581177353, 5196.324477817897, 5215.139501982168, 5759.020966435716, 5764.452377024176, 5778.133280007991, 5799.971000145015, 5801.477866991991, 5686.914696279559, 5738.626989245686, 5758.856028599319, 5820.941790582082, 5831.183634291203, 5374.8925021499745, 5388.407275199725, 5390.6226564140525, 5391.379991301012, 5392.002479541297, 5753.59724819267, 5784.566157538202, 5835.795747148914, 5836.037053886062, 5841.678707671119, 5618.213450116987, 5667.716614169275, 5670.432956704297, 5696.316442026983, 5708.172315014383, 5822.359540450547, 5826.883462330729, 5836.066229403275, 5838.708064596838, 5851.0, 5597.412271711493, 5631.521320687787, 5802.709864506842, 5812.21535092757, 5817.650940943557, 5757.712114394263, 5779.162021506858, 5781.1328300754385, 5787.479126878517, 5812.041013232769, 4384.758838263862, 4406.140802543473, 4415.271480205794, 4419.403380543586, 4424.867253982386, 3886.8833934981994, 3942.8422863085157, 3988.3818008208773, 3988.840446382112, 4031.09300407406, 5341.198820177005, 5356.785728570813, 5358.624896257303, 5362.973185134049, 5383.865403364869, 5725.656460612377, 5727.341355744143, 5727.427257274239, 5728.541716662657, 5729.914051289234, 5162.97418512905, 5231.529162375328, 5350.277712508761, 5389.649672771257, 5412.675239485643, 4955.083309587666, 4960.503949605083, 4961.280614310905, 4970.527799859007, 4970.801167953314, 5911.645301281937, 5964.701764911737, 5968.820935371946, 5984.222051133324, 6008.3390827009, 5610.803621873215, 5769.0, 5801.88396232073, 5855.2973643163095, 5857.58996870215, 5964.075568286922, 5974.044152935509, 5975.760969561169, 5975.850603734942, 5986.161937328865, 5711.942880571307, 5715.8571035724435, 5722.084466485342, 5727.0, 5731.226284451545, 5596.552275817843, 5722.799702010409, 5785.82642520725, 5811.854703632443, 5815.069588865761, 5604.159376093456, 5617.494425501724, 5623.1846382273525, 5634.690092044977, 5640.915386269291, 5425.83722488326, 5644.096944488862, 5645.774169033357, 5645.915311270416, 5647.491725744702, 5450.5367043801725, 5508.724563771875, 5516.062269414129, 5523.364813046551, 5548.944510555004, 5611.887762244651, 5613.663180209037, 5621.437856214346, 5625.46558076982, 5626.930883132191, 5376.946230537801, 5502.0921547944145, 5505.449455054462, 5530.198121272473, 5547.750351234124], "unit": "score", "name": "dojo.html", "value": 5301.3746572843875}, {"lowerIsBetter": false, "replicates": [513.1712284660275, 570.8401647538691, 573.3492486028357, 573.9454751798578, 585.4233579923774, 29409.117726468212, 40796.38805417917, 41690.79154604223, 41742.373864391986, 41822.16355672885, 43131.35302970458, 44129.7793511032, 44175.3373699394, 44200.77899610506, 44261.336079958826, 7529.1341495727875, 8671.17623825737, 8928.821423571524, 10330.380177189356, 10535.31520451172, 10472.0, 10599.09907657846, 10603.310784798963, 10614.628488002922, 10629.52167152476, 10402.21983351248, 10451.16390688743, 10452.68641940743, 10470.534125222475, 10497.737556561071, 10505.212109091848, 10579.100776434012, 10581.523831427605, 10594.0, 10599.682009539687, 10432.739181520446, 10579.78840423195, 10584.576616935314, 10883.0, 10883.074938630147, 42627.147457050996, 42816.57183428157, 43126.0, 43135.56864431347, 43179.78410107961, 3734.2158146788934, 3784.6215378461934, 3806.467094606757, 3879.4374815651854, 4111.198316328318, 29377.11868643944, 29805.850970745007, 29876.103716888527, 29983.100506984825, 30687.693123068708, 4140.296149654536, 4190.078182799779, 4290.2706539888295, 4301.698881078326, 4308.78456077198, 304303.0, 305129.0, 305806.0, 306841.0, 307683.0, 45461.090778184254, 46143.0, 63159.6842015787, 64125.67937160378, 64207.0, 39145.45554538946, 39434.80282598626, 39574.20851582952, 39576.0, 39611.60388396137, 12955.417006234742, 13916.443342266399, 14403.135811851113, 14403.711925761427, 14409.639759006108, 11111.277766945122, 11332.660020199408, 11345.09239260857, 11350.0, 11358.488868000959, 14944.252787360589, 15038.774418383733, 15046.699066018618, 15061.47284845047, 15071.246437678072, 6001.549883758736, 6264.843378915472, 6270.0, 6315.147455093595, 6338.0, 1056.3292309383596, 1103.9558417663204, 1111.2554588425774, 1116.6761639124563, 1162.9882002657741, 30492.390152196833, 30679.07962761121, 32424.189395265308, 32705.672943270263, 32906.0, 1102.079763397572, 1119.2109562758235, 1127.4700890581414, 1161.8257261410856, 1225.3444407242082, 15066.54800355991, 15105.773413398589, 15204.0, 15502.767458488132, 15541.611459713598, 425451.0, 427713.0, 428844.0, 429251.0, 429792.0, 47966.52033479621, 48021.519784801705, 48026.519734802205, 48057.75971120192, 48189.03621927612, 1139.8974092331564, 1406.4866323791741, 1446.5298777897226, 1466.413434626158, 1495.6784291377405, 27976.58035129434, 28278.0, 28767.99312024069, 28855.855720722102, 28933.710662893103, 43943.121137577706, 44452.55547444484, 44662.55337446714, 44667.329990049526, 44728.55271447374, 207409.0, 207490.0, 208464.0, 208669.0, 208669.0, 33725.83137084299, 35093.29813403667, 46866.53133468622, 47454.0, 47643.285350719074, 39119.80440097781, 39331.2133757329, 39430.60569394269, 39567.2086558273, 40686.59313406828, 36962.07594810151, 37200.0, 37271.068223294635, 37330.75435203117, 37421.0, 39258.80370598243, 40035.199296013336, 40299.59700402959, 40485.39271910983, 40714.0, 39693.404598930465, 40114.598854012256, 40649.79675101724, 40707.796461017504, 41322.79338603288, 34774.47838282478, 35996.82001589975, 36156.830590164675, 36294.09264768296, 36589.0, 27023.189304320116, 27377.452450951267, 27528.174154775388, 27582.0, 27638.44723105567], "unit": "score", "name": "ext.html", "value": 19017.838483128577}, {"lowerIsBetter": false, "replicates": [369.71716636772874, 371.74906937816974, 376.51617671292394, 377.7393598417092, 379.4232766195381, 17779.911100444497, 18164.0, 19020.239190432367, 19097.427077187673, 19124.617507649873, 17654.735178972292, 17703.380381686642, 18179.454616361498, 18184.181711822966, 18201.635967280647, 5697.344805347387, 5885.999380105392, 5914.467697907187, 5914.822555323347, 5919.260092488439, 4289.335153051282, 5711.2575365202465, 6130.693465326738, 6401.071844582532, 6413.1662883825275, 6300.842478938041, 6308.053791931224, 6362.618242905417, 6368.713407896633, 6379.71291291893, 6072.2713274406915, 6208.937910620881, 6255.093011513305, 6261.248650161987, 6271.592346497463, 3822.7706337619834, 5392.083345831218, 5521.806736764234, 5608.074667679828, 5609.803656872031, 21256.893715531478, 21447.356579302646, 21467.463313417134, 21655.67516487254, 21692.240771573077, 2324.9883750581307, 2663.9334016649545, 2851.81463204891, 3209.3420848726187, 3217.6943190396873, 13142.342882855819, 13863.098898571661, 13981.650458738512, 13997.30013499321, 14105.294735263298, 1846.5660569766094, 1884.0956340956418, 1987.423647142327, 2012.828909542676, 2034.491377155711, 65699.3430065698, 65940.0, 65956.3404365955, 66352.99999999952, 66946.3305366945, 10570.524326405177, 10592.205584581186, 10628.627998020032, 10699.304545204692, 11036.613718519813, 13735.45058197681, 13772.724545509034, 13865.4453821846, 13879.097858639156, 13901.930490347484, 7988.600569971478, 7989.8402031960195, 8057.758267251992, 8071.394645401619, 8194.50832950025, 7611.4291428142005, 7634.0, 7637.121731001006, 7716.074071111502, 7729.0, 6361.0, 6400.103985442041, 6407.199100112486, 6409.807705768834, 6482.448991835652, 1682.3775203174903, 1736.8089510153873, 1800.2438975630266, 1818.1272988965106, 1862.1806405181676, 947.6114792934864, 961.5769061613008, 979.8040391921644, 979.8285300072602, 996.9003099690118, 16643.0, 16825.326986920387, 16985.745213821803, 17058.914705426392, 17256.0, 1003.1373019203479, 1039.7452624107143, 1059.0, 1073.8657667791526, 1120.9943950280197, 9648.469334186688, 9792.265580081523, 10000.792455820692, 10036.799264014824, 10116.443595602312, 463419.0, 465113.0, 466160.0, 470779.0, 472512.0, 66971.33028669748, 70410.2958970414, 70440.64779676171, 70750.64624676843, 71205.64397178084, 1059.1685526861377, 1075.7471994081384, 1079.3416016230094, 1086.9565217391216, 1090.9127269818396, 15506.0, 15526.534203973899, 15558.144302063496, 16069.956277326672, 16120.283959479602, 32200.35599288048, 32797.836010819796, 33117.66882331146, 33477.49783753197, 33683.47373946915, 43079.35380969225, 44763.32855007242, 45193.32210016918, 45444.0, 45529.54470455253, 7696.46124771283, 8047.718329858427, 8691.174338437839, 8812.471251724917, 8820.0, 9060.592273347847, 12988.610341689764, 13680.384382702603, 13771.311434428038, 13777.724445511234, 10969.122470202525, 11033.944830275797, 11287.0, 11383.487743051748, 12305.446254918372, 11810.940945295219, 11859.466324015268, 12024.038076953997, 12126.454309555915, 12187.634370968884, 5960.076188190664, 8258.958705206436, 11802.937735603837, 12152.149349545447, 12347.073969452507, 7922.207779222032, 7927.801804954922, 8097.676092956216, 8145.714899978472, 8506.404551681322, 11639.883601164218, 11993.460294286953, 12036.0, 12319.69200769988, 12345.197562158432], "unit": "score", "name": "jquery.html", "value": 8978.66035864881}, {"lowerIsBetter": false, "replicates": [1313.1005261395937, 1577.2902194012693, 1594.62526306318, 1826.5433641589602, 1948.7369205157308, 8192.426530142884, 8334.74995750127, 8342.666293348266, 8352.749417517476, 8364.37267204959, 8058.5970701464985, 8207.548584827848, 8222.629981650825, 8230.300424463927, 8231.547264900442, 2115.3653903828867, 2164.751053628837, 2328.860268383902, 2383.5232953409345, 2412.1798588479915, 2367.9052837886466, 2368.52629474105, 2377.2511658827502, 2380.880955952204, 2384.4158181245534, 2285.3486756274465, 2301.4361481436986, 2330.3940975346445, 2331.1258278145697, 2332.0322066342533, 2293.1056887813766, 2293.7935585797277, 2294.105298933417, 2404.675368825204, 2408.903643854244, 2375.5011447596025, 2388.617821148608, 2397.1969390254285, 2421.83047186697, 2426.8786560671897, 8460.280876125536, 8475.23722864939, 8529.360297977615, 8542.23119919204, 8550.40147189697, 4933.629977751683, 5034.219695947134, 5034.395872495324, 5036.0, 5040.949590504085, 3254.0725893120584, 3278.164068162603, 3316.4196265653654, 3435.1927297085167, 3454.896353109411, 1033.777737786372, 1043.7860238651058, 1062.5696592879897, 2014.5567975045467, 2118.290372725139, 11420.885791142066, 11535.134864885084, 11539.538418463335, 11544.191906566544, 11550.36472993985, 4353.673474489426, 4428.247197976351, 4531.909361812745, 4686.203345431285, 4695.107929493385, 9147.039560846148, 9159.587818548182, 9212.677556285498, 9212.815743685089, 9225.354225204172, 5070.492950704974, 5073.441921388644, 5077.441481437039, 5077.517635824591, 5078.669886457368, 3930.3121953657997, 4502.212112880233, 4593.311003349524, 4598.540145985375, 4605.424321959755, 3715.294094122108, 3763.717721170923, 3775.754575952554, 3777.206786574795, 3821.140243445258, 1065.4193464561833, 1067.3915867955345, 1067.5676351077825, 1082.8105081610686, 1121.3384103379046, 1095.6767753512734, 1125.3079356196045, 1126.6056880091903, 1139.5100106953923, 1147.363213416545, 8127.268545830903, 8232.670693172206, 8255.215754503313, 8291.33669306454, 8305.837182794414, 478.4736789531557, 480.7524125075589, 483.39334135660226, 488.9902201955941, 491.09148076059006, 6335.176427064452, 6377.0, 6381.968090159612, 6386.584871983307, 6425.228972523327, 9739.610415583298, 9968.950155249177, 10102.595896164217, 10119.392836429837, 10129.848052279222, 10154.949225253826, 10369.274150809522, 10423.218258630633, 10517.31637443579, 10531.52608132636, 7895.210478952059, 7992.760217193493, 8018.5990700464745, 8018.639161237758, 8103.351731861555, 7978.920210797818, 8092.473989190684, 8111.229433203836, 8130.308923741548, 8167.509949403055, 9202.263818894606, 9273.86089208676, 9282.071792820663, 9388.061193880558, 9469.337146399686, 9381.155695987394, 9456.196223321094, 9611.231101512001, 9684.612615495584, 9819.312648114563, 6562.048502967138, 6729.259781423942, 7442.106947166375, 7554.131274903457, 7667.578283194478, 7988.520688758693, 8033.0360356757565, 8097.838043238984, 8114.837703245784, 8117.188281171835, 6983.755568555076, 7161.713531458683, 7240.420766338575, 7281.672324745505, 7304.780856574312, 6950.3049695030095, 7035.0, 7066.434685225273, 7089.291070892869, 7162.713491460491, 7354.816129596803, 7418.703251870081, 7424.331810137113, 7424.443166762622, 7578.355839753683, 7042.542234754725, 7111.751088711871, 7123.893141602776, 7130.714771409085, 7133.964330178316, 6854.451643868579, 7053.506254562131, 7073.82315442118, 7080.964595176991, 7083.82290442743], "unit": "score", "name": "mootools.html", "value": 4684.198992519702}, {"lowerIsBetter": false, "replicates": [309.2038002144477, 317.5348115011508, 322.83696733149753, 332.20271348762964, 334.2846308898956, 6077.574569780111, 6123.081537769332, 6132.754689812402, 6139.539534534916, 6158.107074474198, 6030.216071910657, 6030.487408570277, 6032.909506357408, 6033.6379817211, 6037.184980027695, 4398.296272596385, 4508.66185036122, 4523.819047238107, 4635.976820115895, 4645.953540464594, 4609.654275929319, 4646.25659894417, 4658.557437043492, 4658.930116048262, 4664.3936288282475, 4593.609543188833, 4594.035252596958, 4597.977010114945, 4598.0344127733215, 4615.561521655454, 4347.760873151976, 4482.798274077674, 4597.149527337453, 4626.44482662081, 4637.628989680834, 3986.900327491807, 4002.8799136025673, 4005.359142537209, 4011.578784227643, 4023.295923213426, 5758.452946970031, 5758.856028599276, 5762.30852297727, 5769.365369809318, 5776.855578610526, 5376.569874410038, 5376.946230537684, 5377.166539186433, 5377.166539186433, 5385.8114965976, 6365.936340636581, 6368.840778980516, 6373.840653983688, 6376.553641245115, 6381.074744162117, 4250.511191212988, 4375.518692943805, 4456.8885777855485, 4476.395686582302, 4480.103979204139, 6617.536772425932, 6638.601683898982, 6663.900041499382, 6666.766663166814, 6667.499937504706, 4381.956180438218, 4386.0569977455, 4387.605115539617, 4391.67062470316, 4398.3842262083335, 4447.666425018137, 4448.7108337957925, 4450.1767173073085, 4453.4433195850515, 4463.732176069446, 5199.792008319625, 5202.947970520322, 5206.167013277857, 5207.479252074762, 5210.557102646318, 6295.811125666238, 6412.871742565123, 6439.034144878306, 6445.677716114269, 6461.386168314003, 1582.2326171806665, 1607.509709538602, 1607.7990251218598, 1607.9758803617956, 1608.8149862765697, 953.8521529162991, 1005.4369553050169, 1005.6832097889142, 1021.7292417509366, 1025.9281850270409, 6122.571420000646, 6156.815295541141, 6157.876842463215, 6161.0, 6167.969160154171, 6693.665316734144, 6716.361945615159, 6718.260991290954, 6720.4287635550545, 6726.932730672728, 6241.063840423973, 6242.843928901723, 6248.750049997949, 6250.062490626351, 6250.312465628777, 3577.8211089445945, 3614.4578313253223, 3614.7831130132276, 3617.6744093031753, 3622.836972336251, 6762.391384775394, 6960.582365058011, 6962.860742785116, 6964.686589103502, 6971.477139214478, 6872.587644741331, 6889.655517224119, 6892.414144797648, 6894.379505844498, 6894.586324820527, 6944.583325000516, 6946.8610627788175, 6947.409470194989, 6947.548409353376, 6949.478789090838, 6690.899636505554, 6696.363845434676, 6697.732090716317, 6698.39714425704, 6708.563943343667, 6385.680715964276, 6569.37590928861, 6605.603663780189, 6620.040094186413, 6620.073189753342, 6938.548994315353, 6947.4789390796905, 6963.7562685305775, 6964.0598519201285, 6975.7209711612995, 4608.193566125848, 4630.745309008037, 4636.44362676481, 4638.026014536985, 4646.047560250073, 6737.383028073129, 6738.966305168443, 6740.898886516608, 6741.325867413219, 6741.966290168518, 6401.0398440232475, 6532.771353002812, 6540.444062254762, 6543.280239173782, 6546.901796473152, 6508.544401891822, 6549.115869357575, 6549.24683661385, 6554.115194448879, 6557.475401967927, 6438.742450301936, 6442.516811239269, 6444.194475690539, 6449.838754031187, 6454.903176452263, 6505.577137486048, 6536.477081833346, 6565.474762019123, 6567.9671601643595, 6570.704318305592, 6031.125486804476, 6167.444929956326, 6400.263969643551, 6400.807975760735, 6403.263624683221], "unit": "score", "name": "prototype.html", "value": 4832.8274866067}, {"lowerIsBetter": false, "replicates": [805.4321703199245, 805.673702150629, 852.2287329966383, 899.7975455522509, 906.7778394293399, 17036.23336949837, 17124.315027398905, 17237.569060773472, 17251.482455526322, 17269.82730172698, 15850.445234416798, 15971.680566388664, 15972.361105555763, 15975.281112349943, 15979.520614381587, 588.2147333310036, 927.350854401918, 934.9859752103741, 945.5697657565826, 946.9384490008161, 939.3330735178032, 942.4910548303908, 945.461087180304, 945.5886689290146, 945.650109459501, 987.5407935310079, 987.7283746969605, 988.0613417253602, 988.5008070924173, 989.2531138990089, 619.3775255867846, 976.7899901521172, 984.0946329376991, 986.8963758805294, 987.5013118375247, 716.9605671688055, 722.5303552690793, 723.3815088099705, 723.4031923662999, 723.8154270660948, 15257.23713814316, 15276.847231527654, 15300.464483743126, 15307.617309567238, 15355.155466449341, 13839.131717218148, 13900.791488127687, 13902.096363736326, 14028.859711402858, 14549.418023279057, 11412.71468213293, 11554.768904621944, 11585.478653460614, 11668.1832271741, 11902.404879755977, 3987.9601203987877, 4015.31739604268, 4059.5737447567876, 4073.8981525461804, 4153.7507749534825, 54779.0, 54949.0, 55027.724861375835, 55361.0, 55820.16269755957, 11269.0, 11326.943365283121, 11345.94327028376, 11554.0, 11833.11251656112, 19551.608967820564, 19730.60538789245, 19754.60490790176, 19783.604327913363, 19787.802121978882, 8779.429337093068, 8867.423617464845, 8983.865242021375, 8983.955080224558, 9000.50497222646, 4680.438347398334, 4727.125481785881, 4964.329815474937, 4967.925481117786, 4972.65191436596, 3350.6314305426386, 3380.0366895435177, 3387.0516255448515, 3388.1360253135294, 3394.711449526818, 602.6444397805228, 604.5888795619021, 610.3131064245905, 627.7363507326934, 628.4626644219218, 580.2456806151986, 588.8792797476507, 641.0672471553878, 653.9149910511603, 663.4062514049898, 9093.954530227307, 9132.589033493376, 9132.863007054899, 9362.391444556082, 9555.808883822285, 599.5593238969354, 715.2882881532804, 747.1258627405948, 747.4730315127822, 748.8577170337618, 4306.336197291195, 4366.8034938427845, 4384.956150438455, 4428.955710442919, 4435.578620031092, 60096.69951650301, 60675.69662151661, 61430.69284653548, 61632.69183654053, 61653.691731541956, 54419.72790136024, 54761.45238547563, 55001.72499137479, 55608.0, 56554.43445565574, 48441.0, 48558.75720621374, 48683.26975095376, 49061.509384905694, 49229.50770492249, 9174.449533028039, 9342.673006444742, 9416.775819143468, 9646.565904534453, 9659.71020869375, 34735.478967815, 35874.4618830723, 36359.0, 36684.81657591695, 37366.62633373631, 42709.0, 45784.31323530083, 46411.303830441895, 46492.0, 47102.05795884132, 12343.259404435763, 12413.813792793297, 12568.975477599388, 12653.936730316289, 12667.619971400873, 11635.53457861676, 13391.196528208338, 13708.3831227593, 14141.505047323295, 14234.288285585471, 11864.406779661154, 11887.881121188677, 12435.875641243472, 12543.93376562966, 12773.48906043785, 12260.693482663004, 12593.811092833797, 12734.745305094031, 12783.0, 13405.0, 12493.812592810933, 12585.622431327074, 12838.955728945351, 13116.606501804961, 13209.603711888658, 10584.89415105839, 10683.839742403714, 11037.944810275898, 11329.773404532029, 11488.310701357945, 10723.839142412715, 11066.649498321287, 11133.665990020312, 11178.776424471302, 11264.267822591506], "unit": "score", "name": "yui.html", "value": 7008.015203355713}], "name": "dromaeo_css", "value": 7236.663989142908}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 110.0, 104.0, 109.0, 110.0, 110.0, 100.0, 109.0, 111.0, 109.0], "unit": "score", "name": "ai-astar", "value": 108.3}, {"lowerIsBetter": true, "replicates": [151.0, 124.0, 148.0, 161.0, 125.0, 157.0, 158.0, 125.0, 175.0, 125.0], "unit": "score", "name": "audio-beat-detection", "value": 144.9}, {"lowerIsBetter": true, "replicates": [159.0, 160.0, 161.0, 161.0, 161.0, 162.0, 159.0, 162.0, 162.0, 160.0], "unit": "score", "name": "audio-dft", "value": 160.7}, {"lowerIsBetter": true, "replicates": [76.0, 75.0, 74.0, 161.0, 73.0, 75.0, 74.0, 75.0, 166.0, 76.0], "unit": "score", "name": "audio-fft", "value": 92.5}, {"lowerIsBetter": true, "replicates": [93.0, 93.0, 147.0, 92.0, 93.0, 93.0, 137.0, 92.0, 92.0, 144.0], "unit": "score", "name": "audio-oscillator", "value": 107.6}, {"lowerIsBetter": true, "replicates": [117.0, 117.0, 117.0, 117.0, 116.0, 117.0, 116.0, 116.0, 117.0, 117.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.7}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 145.0, 146.0, 146.0, 146.0, 145.0, 145.0, 146.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.5}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 95.0, 95.0, 96.0, 96.0, 95.0, 95.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.2}, {"lowerIsBetter": true, "replicates": [56.0, 56.0, 57.0, 57.0, 59.0, 59.0, 57.0, 67.0, 53.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 57.6}, {"lowerIsBetter": true, "replicates": [63.0, 63.0, 63.0, 63.0, 64.0, 67.0, 63.0, 63.0, 65.0, 63.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 63.7}, {"lowerIsBetter": true, "replicates": [77.0, 83.0, 77.0, 77.0, 78.0, 79.0, 77.0, 78.0, 77.0, 78.0], "unit": "score", "name": "stanford-crypto-aes", "value": 78.1}, {"lowerIsBetter": true, "replicates": [117.0, 110.0, 110.0, 111.0, 127.0, 109.0, 118.0, 113.0, 111.0, 122.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 114.8}, {"lowerIsBetter": true, "replicates": [147.0, 134.0, 145.0, 147.0, 149.0, 146.0, 144.0, 144.0, 146.0, 148.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 145.0}, {"lowerIsBetter": true, "replicates": [67.0, 67.0, 68.0, 65.0, 69.0, 67.0, 67.0, 67.0, 67.0, 68.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.2}], "name": "kraken", "value": 1497.8}]} 18:05:45 INFO - Return code: 0 18:05:45 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 18:05:45 INFO - # TBPL SUCCESS # 18:05:45 INFO - Running post-action listener: _resource_record_post_action 18:05:45 INFO - Running post-run listener: _resource_record_post_run 18:05:46 INFO - Total resource usage - Wall time: 1187s; CPU: 13.0%; Read bytes: 270336; Write bytes: 249602048; Read time: 44; Write time: 155632 18:05:46 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 6283264; Read time: 0; Write time: 696 18:05:46 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 270336; Write bytes: 243318784; Read time: 44; Write time: 154936 18:05:46 INFO - Running post-run listener: _upload_blobber_files 18:05:46 INFO - Blob upload gear active. 18:05:46 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 18:05:46 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 18:05:46 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-Aurora', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 18:05:46 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-Aurora -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 18:05:47 INFO - (blobuploader) - INFO - Open directory for files ... 18:05:47 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 18:05:47 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:05:47 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:05:49 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 18:05:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:05:49 INFO - (blobuploader) - INFO - Done attempting. 18:05:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 18:05:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:05:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:05:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 18:05:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:05:51 INFO - (blobuploader) - INFO - Done attempting. 18:05:51 INFO - (blobuploader) - INFO - Iteration through files over. 18:05:51 INFO - Return code: 0 18:05:51 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 18:05:51 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 18:05:51 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7d91a0eeae12b2aa68f98bb275d9660e2e9c7d7649e459536c7510c3e95c2c4945aa7ab8ea3dffbd6de33e76de1d858f3ce58bc08c14bb2d8f4ff5fdadafdf23", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2a107c01b4aefd60ecef9ed4841a3f717d36d65aa0629c322e3f5444769e97e090cafc47f621eaa67072933adba4f7d66496cde40e3e3d5bb3070eb56ecca97e"} 18:05:51 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 18:05:51 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 18:05:51 INFO - Contents: 18:05:51 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7d91a0eeae12b2aa68f98bb275d9660e2e9c7d7649e459536c7510c3e95c2c4945aa7ab8ea3dffbd6de33e76de1d858f3ce58bc08c14bb2d8f4ff5fdadafdf23", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2a107c01b4aefd60ecef9ed4841a3f717d36d65aa0629c322e3f5444769e97e090cafc47f621eaa67072933adba4f7d66496cde40e3e3d5bb3070eb56ecca97e"} 18:05:51 INFO - Running post-run listener: copy_logs_to_upload_dir 18:05:51 INFO - Copying logs to upload dir... 18:05:51 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 18:05:51 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1263.569973 ========= master_lag: 71.66 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 22 mins, 15 secs) (at 2016-03-21 18:07:03.010929) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-21 18:07:03.014428) ========= 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=32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392 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-Aurora/sha512/7d91a0eeae12b2aa68f98bb275d9660e2e9c7d7649e459536c7510c3e95c2c4945aa7ab8ea3dffbd6de33e76de1d858f3ce58bc08c14bb2d8f4ff5fdadafdf23", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2a107c01b4aefd60ecef9ed4841a3f717d36d65aa0629c322e3f5444769e97e090cafc47f621eaa67072933adba4f7d66496cde40e3e3d5bb3070eb56ecca97e"} build_url:https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011364 build_url: 'https://queue.taskcluster.net/v1/task/fYxO9IW1Tuq8Tt3PMCmdLQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7d91a0eeae12b2aa68f98bb275d9660e2e9c7d7649e459536c7510c3e95c2c4945aa7ab8ea3dffbd6de33e76de1d858f3ce58bc08c14bb2d8f4ff5fdadafdf23", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2a107c01b4aefd60ecef9ed4841a3f717d36d65aa0629c322e3f5444769e97e090cafc47f621eaa67072933adba4f7d66496cde40e3e3d5bb3070eb56ecca97e"}' ========= master_lag: 0.41 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-21 18:07:03.432351) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 18:07:03.432709) ========= 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=32c5991c409366f7fec8a718000001d2-1458607276.736949-1943740392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004431 ========= master_lag: 0.19 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-21 18:07:03.624468) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-21 18:07:03.624815) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-21 18:07:03.631435) ========= ========= Total master_lag: 73.44 =========