builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-008 starttime: 1459525888.59 results: success (0) buildid: 20160401062540 builduid: daf3cc0404574d7d8691304ef01ea796 revision: b7488a21db02bf622a430884c0937e215a33b3a2 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.593919) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.594386) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.594680) ========= 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-1459525609.104793-38389421 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006512 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.06 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.659699) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.659997) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.765289) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.765658) ========= 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-1459525609.104793-38389421 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004596 ========= master_lag: 0.09 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.856961) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.857345) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.857698) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:28.857973) ========= 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-1459525609.104793-38389421 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-01 08:51:29-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 221M=0s 2016-04-01 08:51:29 (221 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.256708 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:29.150374) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:29.150657) ========= 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-1459525609.104793-38389421 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014444 ========= master_lag: 0.09 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:29.251685) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-01 08:51:29.252030) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev b7488a21db02bf622a430884c0937e215a33b3a2 --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 b7488a21db02bf622a430884c0937e215a33b3a2 --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-1459525609.104793-38389421 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-01 08:51:29,637 truncating revision to first 12 chars 2016-04-01 08:51:29,637 Setting DEBUG logging. 2016-04-01 08:51:29,637 attempt 1/10 2016-04-01 08:51:29,637 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/b7488a21db02?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-01 08:51:30,493 unpacking tar archive at: mozilla-aurora-b7488a21db02/testing/mozharness/ program finished with exit code 0 elapsedTime=1.337878 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-04-01 08:51:30.629363) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:30.629699) ========= echo b7488a21db02bf622a430884c0937e215a33b3a2 in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'b7488a21db02bf622a430884c0937e215a33b3a2'] 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-1459525609.104793-38389421 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False b7488a21db02bf622a430884c0937e215a33b3a2 program finished with exit code 0 elapsedTime=0.004710 script_repo_revision: 'b7488a21db02bf622a430884c0937e215a33b3a2' ========= master_lag: 0.10 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:30.731968) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:30.732290) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-01 08:51:30.851563) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-04-01 08:51:30.851940) ========= /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-1459525609.104793-38389421 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 08:51:31 INFO - MultiFileLogger online at 20160401 08:51:31 in /builds/slave/test-pgo 08:51:31 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 08:51:31 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 08:51:31 INFO - {'append_to_log': False, 08:51:31 INFO - 'base_work_dir': '/builds/slave/test-pgo', 08:51:31 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 08:51:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 08:51:31 INFO - 'branch': 'Mozilla-Aurora', 08:51:31 INFO - 'buildbot_json_path': 'buildprops.json', 08:51:31 INFO - 'config_files': ('talos/linux_config.py',), 08:51:31 INFO - 'default_actions': ('clobber', 08:51:31 INFO - 'read-buildbot-config', 08:51:31 INFO - 'download-and-extract', 08:51:31 INFO - 'populate-webroot', 08:51:31 INFO - 'create-virtualenv', 08:51:31 INFO - 'install', 08:51:31 INFO - 'run-tests'), 08:51:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 08:51:31 INFO - 'download_minidump_stackwalk': True, 08:51:31 INFO - 'download_symbols': 'ondemand', 08:51:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 08:51:31 INFO - 'tooltool.py': '/tools/tooltool.py', 08:51:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 08:51:31 INFO - '/tools/misc-python/virtualenv.py')}, 08:51:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 08:51:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 08:51:31 INFO - 'installer_path': 'installer.exe', 08:51:31 INFO - 'log_level': 'info', 08:51:31 INFO - 'log_name': 'talos', 08:51:31 INFO - 'log_to_console': True, 08:51:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 08:51:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 08:51:31 INFO - 'opt_config_files': (), 08:51:31 INFO - 'pip_index': False, 08:51:31 INFO - 'sps_profile': False, 08:51:31 INFO - 'sps_profile_interval': 0, 08:51:31 INFO - 'suite': 'dromaeojs', 08:51:31 INFO - 'system_bits': '32', 08:51:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 08:51:31 INFO - 'title': 'talos-linux64-ix-008', 08:51:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 08:51:31 INFO - 'use_talos_json': True, 08:51:31 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 08:51:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 08:51:31 INFO - 'work_dir': 'build'} 08:51:31 INFO - ##### 08:51:31 INFO - ##### Running clobber step. 08:51:31 INFO - ##### 08:51:31 INFO - Running pre-action listener: _resource_record_pre_action 08:51:31 INFO - Running main action method: clobber 08:51:31 INFO - rmtree: /builds/slave/test-pgo/build 08:51:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 08:51:31 INFO - Running post-action listener: _resource_record_post_action 08:51:31 INFO - ##### 08:51:31 INFO - ##### Running read-buildbot-config step. 08:51:31 INFO - ##### 08:51:31 INFO - Running pre-action listener: _resource_record_pre_action 08:51:31 INFO - Running main action method: read_buildbot_config 08:51:31 INFO - Using buildbot properties: 08:51:31 INFO - { 08:51:31 INFO - "project": "", 08:51:31 INFO - "product": "firefox", 08:51:31 INFO - "script_repo_revision": "production", 08:51:31 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 08:51:31 INFO - "repository": "", 08:51:31 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 08:51:31 INFO - "buildid": "20160401062540", 08:51:31 INFO - "pgo_build": "True", 08:51:31 INFO - "basedir": "/builds/slave/test-pgo", 08:51:31 INFO - "buildnumber": 252, 08:51:31 INFO - "slavename": "talos-linux64-ix-008", 08:51:31 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 08:51:31 INFO - "platform": "ubuntu64_hw", 08:51:31 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 08:51:31 INFO - "branch": "mozilla-aurora", 08:51:31 INFO - "repo_path": "releases/mozilla-aurora", 08:51:31 INFO - "revision": "b7488a21db02bf622a430884c0937e215a33b3a2", 08:51:31 INFO - "stage_platform": "linux64-pgo", 08:51:31 INFO - "builduid": "daf3cc0404574d7d8691304ef01ea796", 08:51:31 INFO - "slavebuilddir": "test" 08:51:31 INFO - } 08:51:31 INFO - Found installer url https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2. 08:51:31 INFO - Running post-action listener: _resource_record_post_action 08:51:31 INFO - ##### 08:51:31 INFO - ##### Running download-and-extract step. 08:51:31 INFO - ##### 08:51:31 INFO - Running pre-action listener: _resource_record_pre_action 08:51:31 INFO - Running main action method: download_and_extract 08:51:31 INFO - mkdir: /builds/slave/test-pgo/build/tests 08:51:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:51:31 INFO - https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 08:51:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 08:51:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 08:51:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:32 INFO - Downloaded 1448 bytes. 08:51:32 INFO - Reading from file /builds/slave/test-pgo/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 08:51:32 INFO - Using the following test package requirements: 08:51:32 INFO - {u'common': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 08:51:32 INFO - u'cppunittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:51:32 INFO - u'firefox-47.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 08:51:32 INFO - u'gtest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:51:32 INFO - u'firefox-47.0a2.en-US.linux-x86_64.gtest.tests.zip'], 08:51:32 INFO - u'jittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:51:32 INFO - u'jsshell-linux-x86_64.zip'], 08:51:32 INFO - u'mochitest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:51:32 INFO - u'firefox-47.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 08:51:32 INFO - u'mozbase': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 08:51:32 INFO - u'reftest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:51:32 INFO - u'firefox-47.0a2.en-US.linux-x86_64.reftest.tests.zip'], 08:51:32 INFO - u'talos': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:51:32 INFO - u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'], 08:51:32 INFO - u'web-platform': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:51:32 INFO - u'firefox-47.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 08:51:32 INFO - u'webapprt': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 08:51:32 INFO - u'xpcshell': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 08:51:32 INFO - u'firefox-47.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 08:51:32 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 08:51: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')]} 08:51:32 INFO - https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:51:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:51:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:51:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:35 INFO - Downloaded 23344141 bytes. 08:51:35 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'] 08:51:35 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 08:51:37 INFO - Return code: 0 08:51:37 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 08:51:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:51:37 INFO - https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 08:51:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:51:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 08:51:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:42 INFO - Downloaded 23344141 bytes. 08:51:42 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'] 08:51:42 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 08:51:44 INFO - Return code: 0 08:51:44 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')]} 08:51:44 INFO - https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 08:51:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 08:51:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 08:51:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:45 INFO - Downloaded 10845161 bytes. 08:51:45 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'] 08:51:45 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 08:51:45 INFO - Return code: 0 08:51:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:51:45 INFO - https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 08:51:45 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 08:51:45 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 08:51:45 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/fxz_49RGSNChekfvntEIZQ/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 08:51:47 INFO - Downloaded 60561087 bytes. 08:51:47 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 08:51:47 INFO - mkdir: /builds/slave/test-pgo/properties 08:51:47 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 08:51:47 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 08:51:47 INFO - Contents: 08:51:47 INFO - build_url:https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 08:51:48 INFO - Running post-action listener: _resource_record_post_action 08:51:48 INFO - Running post-action listener: set_extra_try_arguments 08:51:48 INFO - ##### 08:51:48 INFO - ##### Running populate-webroot step. 08:51:48 INFO - ##### 08:51:48 INFO - Running pre-action listener: _resource_record_pre_action 08:51:48 INFO - Running main action method: populate_webroot 08:51:48 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 08:51:48 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 08:51:48 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 08:51:48 INFO - '--tppagecycles', 08:51:48 INFO - '7'], 08:51:48 INFO - 'tests': ['tsvgm']}}, 08:51:48 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 08:51:48 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 08:51:48 INFO - 'tests': ['tresize', 'tcanvasmark']}, 08:51:48 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 08:51:48 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 08:51:48 INFO - 'tests': ['dromaeo_css', 'kraken']}, 08:51:48 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:51:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:51:48 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:51:48 INFO - 'talos_options': ['--e10s'], 08:51:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 08:51:48 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:51:48 INFO - 'tests': ['damp', 'tps']}, 08:51:48 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:51:48 INFO - 'talos_options': ['--e10s'], 08:51:48 INFO - 'tests': ['damp', 'tps']}, 08:51:48 INFO - 'g3': {'tests': ['dromaeo_dom']}, 08:51:48 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 08:51:48 INFO - 'other': {'tests': ['a11yr', 08:51:48 INFO - 'ts_paint', 08:51:48 INFO - 'tpaint', 08:51:48 INFO - 'sessionrestore', 08:51:48 INFO - 'sessionrestore_no_auto_restore', 08:51:48 INFO - 'tabpaint']}, 08:51:48 INFO - 'other-e10s': {'talos_options': ['--e10s'], 08:51:48 INFO - 'tests': ['a11yr', 08:51:48 INFO - 'ts_paint', 08:51:48 INFO - 'tpaint', 08:51:48 INFO - 'sessionrestore', 08:51:48 INFO - 'sessionrestore_no_auto_restore', 08:51:48 INFO - 'tabpaint']}, 08:51:48 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 08:51:48 INFO - 'tests': ['a11yr', 08:51:48 INFO - 'ts_paint', 08:51:48 INFO - 'tpaint', 08:51:48 INFO - 'sessionrestore', 08:51:48 INFO - 'sessionrestore_no_auto_restore', 08:51:48 INFO - 'tabpaint']}, 08:51:48 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 08:51:48 INFO - 'tests': ['a11yr', 08:51:48 INFO - 'ts_paint', 08:51:48 INFO - 'tpaint', 08:51:48 INFO - 'sessionrestore', 08:51:48 INFO - 'sessionrestore_no_auto_restore', 08:51:48 INFO - 'tabpaint']}, 08:51:48 INFO - 'other_l64': {'tests': ['a11yr', 08:51:48 INFO - 'ts_paint', 08:51:48 INFO - 'tpaint', 08:51:48 INFO - 'sessionrestore', 08:51:48 INFO - 'sessionrestore_no_auto_restore', 08:51:48 INFO - 'tabpaint']}, 08:51:48 INFO - 'other_nol64': {'tests': ['a11yr', 08:51:48 INFO - 'ts_paint', 08:51:48 INFO - 'tpaint', 08:51:48 INFO - 'sessionrestore', 08:51:48 INFO - 'sessionrestore_no_auto_restore', 08:51:48 INFO - 'tabpaint']}, 08:51:48 INFO - 'svgr': {'tests': ['tsvgx', 08:51:48 INFO - 'tsvgr_opacity', 08:51:48 INFO - 'tart', 08:51:48 INFO - 'tscrollx', 08:51:48 INFO - 'cart']}, 08:51:48 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 08:51:48 INFO - 'tests': ['tsvgx', 08:51:48 INFO - 'tsvgr_opacity', 08:51:48 INFO - 'tart', 08:51:48 INFO - 'tscrollx', 08:51:48 INFO - 'cart']}, 08:51:48 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:51:48 INFO - 'tests': ['tp5o']}, 08:51:48 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:51:48 INFO - 'talos_options': ['--e10s'], 08:51:48 INFO - 'tests': ['tp5o']}, 08:51:48 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:51:48 INFO - 'talos_options': ['--xperf_path', 08:51:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:51:48 INFO - 'tests': ['tp5n']}, 08:51:48 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 08:51:48 INFO - 'talos_options': ['--e10s', 08:51:48 INFO - '--xperf_path', 08:51:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 08:51:48 INFO - 'tests': ['tp5n']}}, 08:51:48 INFO - 'talos.zip': {'path': '', 08:51:48 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 08:51:48 INFO - Running post-action listener: _resource_record_post_action 08:51:48 INFO - ##### 08:51:48 INFO - ##### Running create-virtualenv step. 08:51:48 INFO - ##### 08:51:48 INFO - Running pre-action listener: _resource_record_pre_action 08:51:48 INFO - Running main action method: create_virtualenv 08:51:48 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 08:51:48 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 08:51:48 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 08:51:48 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 08:51:48 INFO - Using real prefix '/usr' 08:51:48 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 08:51:48 INFO - Installing distribute.............................................................................................................................................................................................done. 08:51:50 INFO - Installing pip.................done. 08:51:50 INFO - Return code: 0 08:51:50 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 08:51:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:51:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:51:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:51:50 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:51:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:51:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:51:50 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 0x7f433454ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdb28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe7f6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, '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-1459525609.104793-38389421', '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 08:51:50 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 08:51:50 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 08:51:50 INFO - Using env: {'DISPLAY': ':0', 08:51:50 INFO - 'HOME': '/home/cltbld', 08:51:50 INFO - 'LANG': 'en_US.UTF-8', 08:51:50 INFO - 'LANGUAGE': 'en_US:en', 08:51:50 INFO - 'LOGNAME': 'cltbld', 08:51:50 INFO - 'MAIL': '/var/mail/cltbld', 08:51:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:51:50 INFO - 'MOZ_NO_REMOTE': '1', 08:51:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:51:50 INFO - 'NO_EM_RESTART': '1', 08:51:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:51:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:51:50 INFO - 'PWD': '/builds/slave/test-pgo', 08:51:50 INFO - 'SHELL': '/bin/bash', 08:51:50 INFO - 'SHLVL': '1', 08:51:50 INFO - 'TERM': 'linux', 08:51:50 INFO - 'TMOUT': '86400', 08:51:50 INFO - 'USER': 'cltbld', 08:51:50 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:51:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:51:50 INFO - '_': '/tools/buildbot/bin/python'} 08:51:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:51:51 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 08:51:51 INFO - Cleaning up... 08:51:51 INFO - Return code: 0 08:51:51 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 08:51: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')]} 08:51:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:51:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:51: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')]} 08:51:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:51:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:51:51 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 0x7f433454ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdb28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe7f6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, '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-1459525609.104793-38389421', '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 08:51:51 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 08:51:51 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 08:51:51 INFO - Using env: {'DISPLAY': ':0', 08:51:51 INFO - 'HOME': '/home/cltbld', 08:51:51 INFO - 'LANG': 'en_US.UTF-8', 08:51:51 INFO - 'LANGUAGE': 'en_US:en', 08:51:51 INFO - 'LOGNAME': 'cltbld', 08:51:51 INFO - 'MAIL': '/var/mail/cltbld', 08:51:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:51:51 INFO - 'MOZ_NO_REMOTE': '1', 08:51:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:51:51 INFO - 'NO_EM_RESTART': '1', 08:51:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:51:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:51:51 INFO - 'PWD': '/builds/slave/test-pgo', 08:51:51 INFO - 'SHELL': '/bin/bash', 08:51:51 INFO - 'SHLVL': '1', 08:51:51 INFO - 'TERM': 'linux', 08:51:51 INFO - 'TMOUT': '86400', 08:51:51 INFO - 'USER': 'cltbld', 08:51:51 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:51:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:51:51 INFO - '_': '/tools/buildbot/bin/python'} 08:51:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:51:51 INFO - Downloading/unpacking psutil>=0.7.1 08:51:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:51:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:51:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:51:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 08:51:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 08:51:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 08:51:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 08:51:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:51:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:51:53 INFO - Installing collected packages: psutil 08:51:53 INFO - Running setup.py install for psutil 08:51:53 INFO - building 'psutil._psutil_linux' extension 08:51:53 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 08:51:53 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 08:51:53 INFO - building 'psutil._psutil_posix' extension 08:51:53 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 08:51:53 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 08:51:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 08:51:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 08:51:53 INFO - Successfully installed psutil 08:51:53 INFO - Cleaning up... 08:51:53 INFO - Return code: 0 08:51:53 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 08:51: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')]} 08:51:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:51:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:51: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')]} 08:51:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:51:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:51: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', '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 0x7f433454ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdb28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe7f6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, '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-1459525609.104793-38389421', '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 08:51: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', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 08:51: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 mozsystemmonitor==0.0.0 08:51:53 INFO - Using env: {'DISPLAY': ':0', 08:51:53 INFO - 'HOME': '/home/cltbld', 08:51:53 INFO - 'LANG': 'en_US.UTF-8', 08:51:53 INFO - 'LANGUAGE': 'en_US:en', 08:51:53 INFO - 'LOGNAME': 'cltbld', 08:51:53 INFO - 'MAIL': '/var/mail/cltbld', 08:51:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:51:53 INFO - 'MOZ_NO_REMOTE': '1', 08:51:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:51:53 INFO - 'NO_EM_RESTART': '1', 08:51:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:51:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:51:53 INFO - 'PWD': '/builds/slave/test-pgo', 08:51:53 INFO - 'SHELL': '/bin/bash', 08:51:53 INFO - 'SHLVL': '1', 08:51:53 INFO - 'TERM': 'linux', 08:51:53 INFO - 'TMOUT': '86400', 08:51:53 INFO - 'USER': 'cltbld', 08:51:53 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:51:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:51:53 INFO - '_': '/tools/buildbot/bin/python'} 08:51:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:51:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 08:51:54 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 08:51:54 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 08:51:54 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 08:51:54 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 08:51:54 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 08:51:54 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 08:51:56 INFO - Downloading mozsystemmonitor-0.0.tar.gz 08:51:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 08:51:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 08:51:56 INFO - Installing collected packages: mozsystemmonitor 08:51:56 INFO - Running setup.py install for mozsystemmonitor 08:51:56 INFO - Successfully installed mozsystemmonitor 08:51:56 INFO - Cleaning up... 08:51:56 INFO - Return code: 0 08:51:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 08:51:56 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')]} 08:51:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:51:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:51:56 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')]} 08:51:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:51:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:51:56 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 0x7f433454ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdb28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe7f6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, '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-1459525609.104793-38389421', '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 08:51:56 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 08:51:56 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 08:51:56 INFO - Using env: {'DISPLAY': ':0', 08:51:56 INFO - 'HOME': '/home/cltbld', 08:51:56 INFO - 'LANG': 'en_US.UTF-8', 08:51:56 INFO - 'LANGUAGE': 'en_US:en', 08:51:56 INFO - 'LOGNAME': 'cltbld', 08:51:56 INFO - 'MAIL': '/var/mail/cltbld', 08:51:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:51:56 INFO - 'MOZ_NO_REMOTE': '1', 08:51:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:51:56 INFO - 'NO_EM_RESTART': '1', 08:51:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:51:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:51:56 INFO - 'PWD': '/builds/slave/test-pgo', 08:51:56 INFO - 'SHELL': '/bin/bash', 08:51:56 INFO - 'SHLVL': '1', 08:51:56 INFO - 'TERM': 'linux', 08:51:56 INFO - 'TMOUT': '86400', 08:51:56 INFO - 'USER': 'cltbld', 08:51:56 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:51:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:51:56 INFO - '_': '/tools/buildbot/bin/python'} 08:51:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:51:56 INFO - Downloading/unpacking blobuploader==1.2.4 08:51:56 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 08:51:56 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 08:51:56 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 08:51:56 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 08:51:56 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 08:51:56 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 08:51:58 INFO - Downloading blobuploader-1.2.4.tar.gz 08:51:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 08:51:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 08:51:58 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 08:51:58 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 08:51:58 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 08:51:58 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 08:51:58 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 08:51:58 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 08:51:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 08:51:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 08:51:59 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 08:51:59 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 08:51:59 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 08:51:59 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 08:51:59 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 08:51:59 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 08:51:59 INFO - Downloading docopt-0.6.1.tar.gz 08:51:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 08:51:59 INFO - Installing collected packages: blobuploader, requests, docopt 08:51:59 INFO - Running setup.py install for blobuploader 08:51:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 08:51:59 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 08:51:59 INFO - Running setup.py install for requests 08:52:00 INFO - Running setup.py install for docopt 08:52:00 INFO - Successfully installed blobuploader requests docopt 08:52:00 INFO - Cleaning up... 08:52:00 INFO - Return code: 0 08:52:00 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:52:00 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')]} 08:52:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:52:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52:00 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')]} 08:52:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:52:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52:00 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 0x7f433454ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdb28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe7f6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, '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-1459525609.104793-38389421', '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 08:52:00 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 08:52:00 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 08:52:00 INFO - Using env: {'DISPLAY': ':0', 08:52:00 INFO - 'HOME': '/home/cltbld', 08:52:00 INFO - 'LANG': 'en_US.UTF-8', 08:52:00 INFO - 'LANGUAGE': 'en_US:en', 08:52:00 INFO - 'LOGNAME': 'cltbld', 08:52:00 INFO - 'MAIL': '/var/mail/cltbld', 08:52:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:52:00 INFO - 'MOZ_NO_REMOTE': '1', 08:52:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:52:00 INFO - 'NO_EM_RESTART': '1', 08:52:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:52:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:52:00 INFO - 'PWD': '/builds/slave/test-pgo', 08:52:00 INFO - 'SHELL': '/bin/bash', 08:52:00 INFO - 'SHLVL': '1', 08:52:00 INFO - 'TERM': 'linux', 08:52:00 INFO - 'TMOUT': '86400', 08:52:00 INFO - 'USER': 'cltbld', 08:52:00 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:52:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:52:00 INFO - '_': '/tools/buildbot/bin/python'} 08:52:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:52:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:52:00 INFO - Running setup.py (path:/tmp/pip-xoLHqQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:52:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:52:00 INFO - Running setup.py (path:/tmp/pip-Wa2AU_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:52:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:52:00 INFO - Running setup.py (path:/tmp/pip-cF9cJI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:52:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:52:00 INFO - Running setup.py (path:/tmp/pip-atRGEn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:52:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 08:52:00 INFO - Running setup.py (path:/tmp/pip-5Rzoiu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 08:52:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:52:00 INFO - Running setup.py (path:/tmp/pip-9Dtp9v-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:52:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:52:00 INFO - Running setup.py (path:/tmp/pip-oxsNN1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:52:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:52:00 INFO - Running setup.py (path:/tmp/pip-7G4iGd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:52:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 08:52:01 INFO - Running setup.py (path:/tmp/pip-py4mg3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 08:52:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 08:52:01 INFO - Running setup.py (path:/tmp/pip-3Qv0qF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 08:52:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:52:01 INFO - Running setup.py (path:/tmp/pip-xEvuFQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:52:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:52:01 INFO - Running setup.py (path:/tmp/pip-WXaoAF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:52:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:52:01 INFO - Running setup.py (path:/tmp/pip-BXuAS4-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:52:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:52:01 INFO - Running setup.py (path:/tmp/pip-vGilSo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:52:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:52:01 INFO - Running setup.py (path:/tmp/pip-igp6dF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:52:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 08:52:01 INFO - Running setup.py (path:/tmp/pip-wJTehM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 08:52:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 08:52:01 INFO - Running setup.py (path:/tmp/pip-v3rJOF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 08:52:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 08:52:01 INFO - Running setup.py install for manifestparser 08:52:01 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 08:52:01 INFO - Running setup.py install for mozcrash 08:52:01 INFO - Running setup.py install for mozdebug 08:52:01 INFO - Running setup.py install for mozdevice 08:52:02 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Running setup.py install for mozfile 08:52:02 INFO - Running setup.py install for mozhttpd 08:52:02 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Running setup.py install for mozinfo 08:52:02 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Running setup.py install for mozInstall 08:52:02 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Running setup.py install for mozleak 08:52:02 INFO - Running setup.py install for mozlog 08:52:02 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Running setup.py install for moznetwork 08:52:02 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 08:52:02 INFO - Running setup.py install for mozprocess 08:52:02 INFO - Running setup.py install for mozprofile 08:52:03 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 08:52:03 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 08:52:03 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 08:52:03 INFO - Running setup.py install for mozrunner 08:52:03 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 08:52:03 INFO - Running setup.py install for mozscreenshot 08:52:03 INFO - Running setup.py install for moztest 08:52:03 INFO - Running setup.py install for mozversion 08:52:03 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 08:52:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 08:52:03 INFO - Cleaning up... 08:52:03 INFO - Return code: 0 08:52:03 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:52: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')]} 08:52:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:52:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52: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')]} 08:52:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:52:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52:03 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 0x7f433454ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdb28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe7f6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, '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-1459525609.104793-38389421', '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 08:52:03 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 08:52:03 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 08:52:03 INFO - Using env: {'DISPLAY': ':0', 08:52:03 INFO - 'HOME': '/home/cltbld', 08:52:03 INFO - 'LANG': 'en_US.UTF-8', 08:52:03 INFO - 'LANGUAGE': 'en_US:en', 08:52:03 INFO - 'LOGNAME': 'cltbld', 08:52:03 INFO - 'MAIL': '/var/mail/cltbld', 08:52:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:52:03 INFO - 'MOZ_NO_REMOTE': '1', 08:52:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:52:03 INFO - 'NO_EM_RESTART': '1', 08:52:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:52:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:52:03 INFO - 'PWD': '/builds/slave/test-pgo', 08:52:03 INFO - 'SHELL': '/bin/bash', 08:52:03 INFO - 'SHLVL': '1', 08:52:03 INFO - 'TERM': 'linux', 08:52:03 INFO - 'TMOUT': '86400', 08:52:03 INFO - 'USER': 'cltbld', 08:52:03 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:52:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:52:03 INFO - '_': '/tools/buildbot/bin/python'} 08:52:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:52:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:52:03 INFO - Running setup.py (path:/tmp/pip-3GGLd2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 08:52:03 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)) 08:52:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:52:03 INFO - Running setup.py (path:/tmp/pip-aNa0rV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 08:52:03 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)) 08:52:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:52:03 INFO - Running setup.py (path:/tmp/pip-AIJcmB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 08:52:03 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)) 08:52:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:52:03 INFO - Running setup.py (path:/tmp/pip-RPK0zC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 08:52:03 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)) 08:52:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 08:52:03 INFO - Running setup.py (path:/tmp/pip-K431PR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:52:04 INFO - Running setup.py (path:/tmp/pip-DGZCLI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:52:04 INFO - Running setup.py (path:/tmp/pip-2vfJcd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:52:04 INFO - Running setup.py (path:/tmp/pip-s58LIy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 08:52:04 INFO - Running setup.py (path:/tmp/pip-Kxm3Vw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 08:52:04 INFO - Running setup.py (path:/tmp/pip-KDA60J-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:52:04 INFO - Running setup.py (path:/tmp/pip-hN2EDA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:52:04 INFO - Running setup.py (path:/tmp/pip-OsiHep-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:52:04 INFO - Running setup.py (path:/tmp/pip-aqOsnV-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:52:04 INFO - Running setup.py (path:/tmp/pip-jXyT7x-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:52:04 INFO - Running setup.py (path:/tmp/pip-zG6ix3-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 08:52:04 INFO - Running setup.py (path:/tmp/pip-tzLSHp-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 08:52:04 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)) 08:52:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 08:52:04 INFO - Running setup.py (path:/tmp/pip-VkNJxo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 08:52:04 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)) 08:52:04 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)) 08:52:04 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)) 08:52:04 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)) 08:52:04 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)) 08:52:04 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)) 08:52:04 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 08:52:04 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 08:52:04 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 08:52:04 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 08:52:04 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 08:52:04 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 08:52:04 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 08:52:07 INFO - Downloading blessings-1.6.tar.gz 08:52:07 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 08:52:07 INFO - Installing collected packages: blessings 08:52:07 INFO - Running setup.py install for blessings 08:52:07 INFO - Successfully installed blessings 08:52:07 INFO - Cleaning up... 08:52:07 INFO - Return code: 0 08:52:07 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 08:52:07 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 08:52:07 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 08:52:07 INFO - Reading from file tmpfile_stdout 08:52:07 INFO - Current package versions: 08:52:07 INFO - argparse == 1.2.1 08:52:07 INFO - blessings == 1.6 08:52:07 INFO - blobuploader == 1.2.4 08:52:07 INFO - docopt == 0.6.1 08:52:07 INFO - manifestparser == 1.1 08:52:07 INFO - mozInstall == 1.12 08:52:07 INFO - mozcrash == 0.17 08:52:07 INFO - mozdebug == 0.1 08:52:07 INFO - mozdevice == 0.48 08:52:07 INFO - mozfile == 1.2 08:52:07 INFO - mozhttpd == 0.7 08:52:07 INFO - mozinfo == 0.9 08:52:07 INFO - mozleak == 0.1 08:52:07 INFO - mozlog == 3.1 08:52:07 INFO - moznetwork == 0.27 08:52:07 INFO - mozprocess == 0.22 08:52:07 INFO - mozprofile == 0.28 08:52:07 INFO - mozrunner == 6.11 08:52:07 INFO - mozscreenshot == 0.1 08:52:07 INFO - mozsystemmonitor == 0.0 08:52:07 INFO - moztest == 0.7 08:52:07 INFO - mozversion == 1.4 08:52:07 INFO - psutil == 3.1.1 08:52:07 INFO - requests == 1.2.3 08:52:07 INFO - wsgiref == 0.1.2 08:52:07 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 08:52:07 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')]} 08:52:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:52:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52:07 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')]} 08:52:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:52:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52:07 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 0x7f433454ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdb28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe7f6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, '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-1459525609.104793-38389421', '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 08:52:07 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 08:52:07 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 08:52:07 INFO - Using env: {'DISPLAY': ':0', 08:52:07 INFO - 'HOME': '/home/cltbld', 08:52:07 INFO - 'LANG': 'en_US.UTF-8', 08:52:07 INFO - 'LANGUAGE': 'en_US:en', 08:52:07 INFO - 'LOGNAME': 'cltbld', 08:52:07 INFO - 'MAIL': '/var/mail/cltbld', 08:52:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:52:07 INFO - 'MOZ_NO_REMOTE': '1', 08:52:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:52:07 INFO - 'NO_EM_RESTART': '1', 08:52:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:52:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:52:07 INFO - 'PWD': '/builds/slave/test-pgo', 08:52:07 INFO - 'SHELL': '/bin/bash', 08:52:07 INFO - 'SHLVL': '1', 08:52:07 INFO - 'TERM': 'linux', 08:52:07 INFO - 'TMOUT': '86400', 08:52:07 INFO - 'USER': 'cltbld', 08:52:07 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:52:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:52:07 INFO - '_': '/tools/buildbot/bin/python'} 08:52:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:52:07 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)) 08:52:07 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)) 08:52:07 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)) 08:52:07 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)) 08:52:07 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)) 08:52:07 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)) 08:52:07 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)) 08:52:07 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)) 08:52:07 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)) 08:52:07 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)) 08:52:07 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)) 08:52:07 INFO - Cleaning up... 08:52:07 INFO - Return code: 0 08:52:07 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 08:52:07 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')]} 08:52:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:52:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52:07 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')]} 08:52:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:52:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52:07 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 0x7f433454ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdb28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe7f6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, '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-1459525609.104793-38389421', '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 08:52:07 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 08:52:07 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 08:52:07 INFO - Using env: {'DISPLAY': ':0', 08:52:07 INFO - 'HOME': '/home/cltbld', 08:52:07 INFO - 'LANG': 'en_US.UTF-8', 08:52:07 INFO - 'LANGUAGE': 'en_US:en', 08:52:07 INFO - 'LOGNAME': 'cltbld', 08:52:07 INFO - 'MAIL': '/var/mail/cltbld', 08:52:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:52:07 INFO - 'MOZ_NO_REMOTE': '1', 08:52:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:52:07 INFO - 'NO_EM_RESTART': '1', 08:52:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:52:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:52:07 INFO - 'PWD': '/builds/slave/test-pgo', 08:52:07 INFO - 'SHELL': '/bin/bash', 08:52:07 INFO - 'SHLVL': '1', 08:52:07 INFO - 'TERM': 'linux', 08:52:07 INFO - 'TMOUT': '86400', 08:52:07 INFO - 'USER': 'cltbld', 08:52:07 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:52:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:52:07 INFO - '_': '/tools/buildbot/bin/python'} 08:52:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:52:07 INFO - Downloading/unpacking jsonschema 08:52:07 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 08:52:07 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 08:52:07 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 08:52:07 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 08:52:07 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 08:52:07 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 08:52:10 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 08:52:10 INFO - Downloading/unpacking functools32 (from jsonschema) 08:52:10 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 08:52:10 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 08:52:10 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 08:52:10 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 08:52:10 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 08:52:10 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 08:52:10 INFO - Downloading functools32-3.2.3-2.tar.gz 08:52:10 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 08:52:10 INFO - warning: no files found matching '*.txt' 08:52:10 INFO - no previously-included directories found matching 'build' 08:52:10 INFO - no previously-included directories found matching 'dist' 08:52:10 INFO - no previously-included directories found matching '.git*' 08:52:10 INFO - Installing collected packages: jsonschema, functools32 08:52:10 INFO - Running setup.py install for functools32 08:52:10 INFO - warning: no files found matching '*.txt' 08:52:10 INFO - no previously-included directories found matching 'build' 08:52:10 INFO - no previously-included directories found matching 'dist' 08:52:10 INFO - no previously-included directories found matching '.git*' 08:52:10 INFO - Successfully installed jsonschema functools32 08:52:10 INFO - Cleaning up... 08:52:10 INFO - Return code: 0 08:52:10 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 08:52:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:52:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 08:52:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:52:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 08:52:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 08:52:10 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 0x7f433454ef10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xdb28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe7f6d0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, '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-1459525609.104793-38389421', '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 08:52:10 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 08:52:10 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 08:52:10 INFO - Using env: {'DISPLAY': ':0', 08:52:10 INFO - 'HOME': '/home/cltbld', 08:52:10 INFO - 'LANG': 'en_US.UTF-8', 08:52:10 INFO - 'LANGUAGE': 'en_US:en', 08:52:10 INFO - 'LOGNAME': 'cltbld', 08:52:10 INFO - 'MAIL': '/var/mail/cltbld', 08:52:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:52:10 INFO - 'MOZ_NO_REMOTE': '1', 08:52:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:52:10 INFO - 'NO_EM_RESTART': '1', 08:52:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:52:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:52:10 INFO - 'PWD': '/builds/slave/test-pgo', 08:52:10 INFO - 'SHELL': '/bin/bash', 08:52:10 INFO - 'SHLVL': '1', 08:52:10 INFO - 'TERM': 'linux', 08:52:10 INFO - 'TMOUT': '86400', 08:52:10 INFO - 'USER': 'cltbld', 08:52:10 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:52:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:52:10 INFO - '_': '/tools/buildbot/bin/python'} 08:52:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 08:52:10 INFO - Downloading/unpacking flake8 08:52:10 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 08:52:10 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 08:52:10 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 08:52:10 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 08:52:10 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 08:52:10 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 08:52:13 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 08:52:13 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 08:52:13 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 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 08:52:13 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 08:52:14 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 08:52:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:52:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:52:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:52:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:52:14 INFO - no previously-included directories found matching 'docs/_build' 08:52:14 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 08:52:14 INFO - Running setup.py install for pep8 08:52:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 08:52:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 08:52:14 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 08:52:14 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 08:52:14 INFO - no previously-included directories found matching 'docs/_build' 08:52:14 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 08:52:14 INFO - Successfully installed flake8 mccabe pyflakes pep8 08:52:14 INFO - Cleaning up... 08:52:15 INFO - Return code: 0 08:52:15 INFO - Running post-action listener: _resource_record_post_action 08:52:15 INFO - Running post-action listener: _start_resource_monitoring 08:52:15 INFO - Starting resource monitoring. 08:52:15 INFO - ##### 08:52:15 INFO - ##### Running install step. 08:52:15 INFO - ##### 08:52:15 INFO - Running pre-action listener: _resource_record_pre_action 08:52:15 INFO - Running main action method: install 08:52:15 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 08:52:15 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 08:52:15 INFO - Reading from file tmpfile_stdout 08:52:15 INFO - Detecting whether we're running mozinstall >=1.0... 08:52:15 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 08:52:15 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 08:52:15 INFO - Reading from file tmpfile_stdout 08:52:15 INFO - Output received: 08:52:15 INFO - Usage: mozinstall [options] installer 08:52:15 INFO - Options: 08:52:15 INFO - -h, --help show this help message and exit 08:52:15 INFO - -d DEST, --destination=DEST 08:52:15 INFO - Directory to install application into. [default: 08:52:15 INFO - "/builds/slave/test-pgo"] 08:52:15 INFO - --app=APP Application being installed. [default: firefox] 08:52:15 INFO - mkdir: /builds/slave/test-pgo/build/application 08:52:15 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'] 08:52:15 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 08:52:30 INFO - Reading from file tmpfile_stdout 08:52:30 INFO - Output received: 08:52:30 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 08:52:30 INFO - Running post-action listener: _resource_record_post_action 08:52:30 INFO - ##### 08:52:30 INFO - ##### Running run-tests step. 08:52:30 INFO - ##### 08:52:30 INFO - Running pre-action listener: _resource_record_pre_action 08:52:30 INFO - Running main action method: run_tests 08:52:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 08:52:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 08:52:30 INFO - Python 2.7.3 08:52:30 INFO - Return code: 0 08:52:30 INFO - grabbing minidump binary from tooltool 08:52:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 08:52:30 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 0xf0e920>, '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 0xf0f820>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xf0fcb0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 08:52:30 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 08:52:30 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 08:52:30 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 08:52:30 INFO - Return code: 0 08:52:30 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 08:52:30 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 08:52:30 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 08:52:30 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 08:52:30 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 08:52:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 08:52:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 08:52:31 INFO - Return code: 0 08:52:31 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/fxz_49RGSNChekfvntEIZQ/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 08:52:31 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/fxz_49RGSNChekfvntEIZQ/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 08:52:31 INFO - Using env: {'DISPLAY': ':0', 08:52:31 INFO - 'HOME': '/home/cltbld', 08:52:31 INFO - 'LANG': 'en_US.UTF-8', 08:52:31 INFO - 'LANGUAGE': 'en_US:en', 08:52:31 INFO - 'LOGNAME': 'cltbld', 08:52:31 INFO - 'MAIL': '/var/mail/cltbld', 08:52:31 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 08:52:31 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 08:52:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 08:52:31 INFO - 'MOZ_NO_REMOTE': '1', 08:52:31 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 08:52:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 08:52:31 INFO - 'NO_EM_RESTART': '1', 08:52:31 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 08:52:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 08:52:31 INFO - 'PWD': '/builds/slave/test-pgo', 08:52:31 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 08:52:31 INFO - 'SHELL': '/bin/bash', 08:52:31 INFO - 'SHLVL': '1', 08:52:31 INFO - 'TERM': 'linux', 08:52:31 INFO - 'TMOUT': '86400', 08:52:31 INFO - 'USER': 'cltbld', 08:52:31 INFO - 'XDG_SESSION_COOKIE': '32c5991c409366f7fec8a718000001d2-1459525609.104793-38389421', 08:52:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 08:52:31 INFO - '_': '/tools/buildbot/bin/python'} 08:52:31 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/fxz_49RGSNChekfvntEIZQ/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 08:52:32 INFO - mozversion application_buildid: 20160401062540 08:52:32 INFO - mozversion application_changeset: b7488a21db02bf622a430884c0937e215a33b3a2 08:52:32 INFO - mozversion application_display_name: FirefoxDeveloperEdition 08:52:32 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 08:52:32 INFO - mozversion application_name: Firefox 08:52:32 INFO - mozversion application_remotingname: firefox-dev 08:52:32 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:52:32 INFO - mozversion application_vendor: Mozilla 08:52:32 INFO - mozversion application_version: 47.0a2 08:52:32 INFO - mozversion platform_buildid: 20160401062540 08:52:32 INFO - mozversion platform_changeset: b7488a21db02bf622a430884c0937e215a33b3a2 08:52:32 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 08:52:32 INFO - mozversion platform_version: 47.0a2 08:52:32 INFO - using testdate: 1459525952 08:52:32 INFO - actual date: 1459525952 08:52:32 INFO - starting webserver on 'localhost:35178' 08:52:32 INFO - SUITE-START | Running 2 tests 08:52:32 INFO - TEST-START | dromaeo_css 08:52:32 INFO - operating with platform_type : linux_ 08:52:32 INFO - Initialising browser for dromaeo_css test... 08:52:32 INFO - TEST-INFO | started process 16394 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_umwVe/profile http://localhost:35178/getInfo.html) 08:52:36 INFO - PROCESS | 16394 | __metrics Screen width/height:1600/1200 08:52:36 INFO - PROCESS | 16394 | colorDepth:24 08:52:36 INFO - PROCESS | 16394 | Browser inner width/height: 1024/697 08:52:36 INFO - PROCESS | 16394 | __metrics 08:52:37 INFO - PROCESS | 16394 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 08:52:38 INFO - TEST-INFO | 16394: exit 0 08:52:38 INFO - Browser initialized. 08:52:38 INFO - Running cycle 1/1 for dromaeo_css test... 08:52:38 INFO - TEST-INFO | started process 16481 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp_umwVe/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 08:52:49 INFO - PROCESS | 16481 | RSS: Main: 144416768 08:52:49 INFO - PROCESS | 16481 | 08:53:40 INFO - PROCESS | 16481 | 1459526020583 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] 08:55:48 INFO - PROCESS | 16481 | Cycle 1(1): loaded http://localhost:35178/tests/dromaeo/cssquery-dojo.html (next: http://localhost:35178/tests/dromaeo/cssquery-ext.html) 08:55:49 INFO - PROCESS | 16481 | RSS: Main: 252510208 08:55:49 INFO - PROCESS | 16481 | 08:58:51 INFO - PROCESS | 16481 | Cycle 1(1): loaded http://localhost:35178/tests/dromaeo/cssquery-ext.html (next: http://localhost:35178/tests/dromaeo/cssquery-jquery.html) 08:58:51 INFO - PROCESS | 16481 | RSS: Main: 229257216 08:58:51 INFO - PROCESS | 16481 | 09:01:53 INFO - PROCESS | 16481 | Cycle 1(1): loaded http://localhost:35178/tests/dromaeo/cssquery-jquery.html (next: http://localhost:35178/tests/dromaeo/cssquery-mootools.html) 09:01:54 INFO - PROCESS | 16481 | RSS: Main: 223768576 09:01:54 INFO - PROCESS | 16481 | 09:04:56 INFO - PROCESS | 16481 | Cycle 1(1): loaded http://localhost:35178/tests/dromaeo/cssquery-mootools.html (next: http://localhost:35178/tests/dromaeo/cssquery-prototype.html) 09:04:56 INFO - PROCESS | 16481 | RSS: Main: 190480384 09:04:56 INFO - PROCESS | 16481 | 09:07:59 INFO - PROCESS | 16481 | Cycle 1(1): loaded http://localhost:35178/tests/dromaeo/cssquery-prototype.html (next: http://localhost:35178/tests/dromaeo/cssquery-yui.html) 09:07:59 INFO - PROCESS | 16481 | RSS: Main: 211472384 09:07:59 INFO - PROCESS | 16481 | 09:11:02 INFO - PROCESS | 16481 | Cycle 1(1): loaded http://localhost:35178/tests/dromaeo/cssquery-yui.html (next: http://localhost:35178/tests/dromaeo/cssquery-dojo.html) 09:11:02 INFO - PROCESS | 16481 | RSS: Main: 259227648 09:11:02 INFO - PROCESS | 16481 | 09:11:02 INFO - PROCESS | 16481 | __start_tp_report 09:11:02 INFO - PROCESS | 16481 | _x_x_mozilla_page_load 09:11:02 INFO - PROCESS | 16481 | _x_x_mozilla_page_load_details 09:11:02 INFO - PROCESS | 16481 | |i|pagename|runs| 09:11:02 INFO - PROCESS | 16481 | |0;dojo.html;3215.6623554526773;3278.5573947517078;3320.6679332066783;3321.485169798682;3358.9755124686967;5343.225232341313;5354.116570765824;5421.783128674848;5438.129899216126;5474.644148130369;5400.216968539569;5414.269073675063;5454.972725136378;5459.181122831567;5461.18082287657;4775.235962246042;4985.900281994358;5012.974935125338;5069.214271787879;5101.744912754366;4868.707877527359;4923.679960802554;4960.305557221974;4964;4971.850844474671;4990.65065445419;5045.495450454961;5058;5071.087204303224;5090.516400941905;4957.380327459067;5006.724630145341;5017.623678224148;5021.472745361739;5026.623003274751;4760.785764640599;4860.149473842099;4935.3090567320605;4960.280759289919;4964.05682920244;5226.425093239779;5226.817061402832;5243.030039442715;5254.133068043769;5258.7370631468275;5809.941900580982;5830.679312637803;5838;5843;5869.325027621835;5568.52667523261;5785.855353616151;5794.246747922785;5874.853128671817;5881.441263080001;5457.208704737831;5458.754356053947;5460.372057213472;5465.781368745245;5467.125259958428;5747.051736463521;5893.911591326134;5948.494377977834;5950.642961422329;5962.880742385128;5717.085266357363;5779.942200577941;5784.59507834456;5806.854828629233;5822.475977162076;5811.4479124483105;5819.70901454934;5835.708214589254;5847.795327163529;5848.795292164754;5561.555075593943;5748.367679555246;5790.42095790426;5798.362180160179;5803.100519419497;5789.45000224978;5789.507891829242;5791.913121303184;5834.591578589543;5858.033424484912;4407.889802754957;4441.689081764245;4443.688941774045;4447.510773814878;4472.619827314649;3891.280113179071;3968.3650615901315;4006.7996600169877;4038.1116154445976;4042.312806822847;5447.918281225785;5474.644148130359;5477.917831232535;5479.6164268500825;5481.12302031681;5772.5670574707065;5780.450857168562;5781.82654520365;5783.88432231353;5788.797392091341;5245.318108645852;5444.40111587725;5466.835994920159;5479.835604931858;5540.473655002768;4875.268709693574;4908.386451693538;4908.852734417973;4909.533594308535;4941.579965702956;5946;5950.434708702666;5950.5239580834295;5951.256092988377;5953.76184952597;5531.391546929915;5770.798022069207;5838.065909454467;5872.354041055395;5881.941180588139;5965.642061476152;5967.731452084753;5969.134475500941;5969.791057312973;5975.133605627247;5523.530499907552;5728;5732.684702341245;5737.770489180386;5739.110437882135;5760.711964401679;5787.565932554991;5821.476067153807;5824.097264923944;5849.5612829037145;5632.014397480507;5638.126090455986;5638.548916086621;5639.661620302795;5644.604877658525;5484.917726234189;5633.690147041952;5634.126710359901;5642.887142257214;5649.491545760901;5606.747696353756;5650.039493286069;5652.236948011966;5654.321481422256;5688.089905615082;5684.033714268501;5696.886062278814;5718.027935250934;5724.427557244242;5725.541956643375;5340.49265319794;5576.024195765806;5598.1322894951345;5629.211910332475;5644.068728659725 09:11:02 INFO - PROCESS | 16481 | |1;ext.html;521.6922016010556;553.676099481803;555.5250261026822;556.9415211402805;583.4807021750643;30669.539956900637;31422.84288578557;31431.68568314316;31448.213794655145;31449.842750786273;40694.59305406945;41813;41869.371959420634;41872.58127418725;41966.16067678652;8941.37410381272;9191.816163676756;9200.907990920106;9206.171444569987;9208.401453905508;9046.3667543272;9167.770805729844;9189;9192.172704456598;9197.218236449877;9127.315451341143;9256.213221876149;9257.861132083024;9458.716238512821;9480.525973701322;9304.162625363715;9400.670976515788;9404.858927116098;9405.388649737744;9410.106039926197;9239.907600923972;9384.812303753955;9385.624575016991;9386.718398448058;9390.107939745712;44913.326300105524;45302.32046519305;45372;45403.54596454059;45455.318170227474;3482.564679415073;3706.4810926470313;3725.515682961198;4210.32634778437;4300.548442413533;33435.49846752301;33459.83270083634;33680.15799605005;34184.82907585446;34291.48562771561;4175.832966681329;4277.101808620194;4278.443802305712;4301.956980430218;4303.268444364466;215776;215920;216288;217274;217438;64862.35137648563;65637.67181164064;65688;65700.34299657038;65708.34291657117;76834.6158269205;77946;77966.2203377959;78043.60978195186;78050.21949780543;15363.769543456858;15389.692206155814;15482.690346193012;15501;15670.9216453917;12711.110222284351;12742.171758835646;12789.10476266671;12810.295433751233;12868.742625147444;22337.888310558345;22686.773132268467;22698.205562805553;22833;24059.759402406104;8584.184502472255;9004.099590040943;9066.36535442526;9088.409253398508;9136.223421009288;1003.7942221844504;1085.6742977106837;1088.0751361342795;1209.4194786502528;1287.3627554360464;30697.38605227883;30737.38525229483;31088.22279443032;31198.220044498616;31668.524972125437;1131.666361390673;1151.1826603111717;1218.031664826465;1242.8322176506238;1278.1500302299053;15980.92009539968;16155.273012714457;16419.507414777574;16477.505674829776;16528.338866445207;342489;344257;344868;346997;347261;59749.40250597525;60195.09707354393;60289.39710602925;60292.698536507036;60297;1383.5918404070824;1454.6508837879044;1494.5516345096428;1529.4723320454425;1539.1073177557214;28004.52666896053;28553.571696424155;28590.42819143564;29030.983915562854;29039.85480072586;49101.508984911125;49607;49744.75127624339;49764;49770;231871;232746;232802;232865;233066;30699.846500767355;35435.468467973515;35523.644763553064;36062.639373605925;36293;42318.1536369277;42678.22591531541;42943.57056429521;43162.56837431585;43337.78331108324;35163.120921977155;35686.464703028956;35759.28481430409;37692.246155076195;39152;37394.626053740205;38070.809645951595;38590.4211436823;38618.22763544769;39082.413763792996;38061.2387752249;38387.232255354174;38853.805730971166;39270.214595708494;39471.2105757889;33468;34329.31341373209;34409.48385774165;34606.134846628025;35107;26620.600690989264;26627;26788.59817102784;26789.86605066962;26988 09:11:02 INFO - PROCESS | 16481 | |2;jquery.html;383.54358313606804;384.126113092714;389.89862635714724;395.54314766444764;404.56307188236707;14714.190719510423;16803.49589512315;17993.280268789233;19402.90298548507;19480.70778938317;17457.476275711717;17768;17992.730109048374;17995.280188792432;18032.4590262292;5376.381716102659;5422.376426710929;5642.379338272786;5660.179274005287;5686.800961966332;5500.5874559408;5502.422245664207;5520.944790552083;5525.475079867406;5531.2532808071;5407.675539467625;5493.835184944458;5864.1203819427;5872.9706351468185;5873.353931067579;5725.198472213893;5731.971340143294;5745.511631511285;5746.856328591777;5747.798827041075;5169.095408303532;5357.4106848246665;5361.0618141825025;5366.060939335601;5544.085225937715;13745.931270343684;13759.10565813229;14951.551453456414;20761.273355432637;20761.5847683047;2292.713410823647;2407.8073754099805;2463.802895768334;2488.35302821266;2501.6997960244703;10218.080372766486;10586.470676466222;11601.12991525639;11945.761084778344;13582.728345433135;1882.3035476873508;1925.422373288008;1999.1103958738368;2019.0914088660015;2062.4019034479984;60828.39171608272;62589;63087.36912630861;63201;69542.65228673824;10924.726881828017;10980.780384392427;11376;11467.139964502696;11554.075673946065;13756.724865502634;14119.505817296345;15284.694306113815;15329.770053449207;15344.846551534341;6528.934710652833;6677.766278180337;7673.693052277847;8096.149904260085;8134.674613015532;7750.14748377678;7803.4783217273225;7822.687092516349;7845.5684937329;7855.8821617675785;4895.241237608177;4935.87660308488;4949.752512374367;4953.826616068421;4977.776000080005;1846.4737549798242;1871.0457666590137;1971.8816870987787;2006.428167972121;2010.7989201079774;917.5366439947784;981.259149342242;1017.5624481472889;1021.8416145497459;1096.2107282756403;16679.416220432227;16911.40810071666;17367.392141274995;17605;17765.911170444324;1026;1030.3766221435924;1072.6621114349111;1079.794838980591;1110.4225802582612;9745.415275083376;10216.846747298796;10315.587376504856;10317;10345.586176552853;465259;467971;472120;475199;479368;79728.60135699285;79822.20177798264;83681.58159209165;84272;84921.57539212264;1017.704865588971;1032.695354870315;1053.1890444357803;1053.636495409098;1055.4036969112426;15358.385664573292;15708.371665133724;15744.60638484047;15794.9210253948;15883.364665413716;29667.55498667565;30238.395232095674;35682.64317356793;36346.8182659085;37429.6257037437;47843;53072;53303.200451994024;54026.18960715514;54307;11570.421478925851;12050.674425812978;12076.21504602198;12140.514379424723;12147.635570932885;13428.19430834153;13456.86543134556;13511;13686.178829270275;14077.507287244896;8576.571171441528;11419.257748246337;11976.341301228516;12101.515939362327;12322.50709971627;8785.912140878509;8818.647254109765;8824.338174637056;8870.689525866565;9048.321375896703;8556.700515481929;8652.178043085896;8882.955585222033;8940.86588701157;9229.446233226028;11706.297622142698;11753;11784.234024788362;12097.2136811107;12207.75584488323;11603.187776855877;12048.216865903689;12126.393680316125;12275.324857132944;12520.561780337644 09:11:02 INFO - PROCESS | 16481 | |3;mootools.html;1458.212565214784;1592.1163754116465;1599.1604407685968;1858.3031363238786;1951.9902400487995;7772.844543109141;7864.567448790314;7908.0905695844995;7915.1689072647405;7968.521888686676;8301.045379781326;8443.493390396581;8446;8455.957720211405;8467.661293548266;2122.9893850530802;2408.6748288980984;2416;2434.793042591373;2480.293116461809;2448.375664205634;2456.9631455528183;2471.480988992314;2472.184179220862;2473.109680515013;2422.9515409691794;2445.3519817248443;2450.754924507544;2454.509098180371;2455.533448644761;2410.120306088274;2450.6079027355627;2477.6283557466345;2478.4423504711294;2480.3923038855414;2446.694163229596;2449.4243852694603;2461.507698460297;2461.7045954485397;2463.4334103156193;8609.182127697859;8688.956555217246;8709.738707838775;8713.390062695615;8715.825683486295;5120.590352771769;5282.81510147143;5316.415194328621;5321.574274058066;5325.840224793263;3243.9837800810847;3322.7175690066374;3336.432806422914;3366.3772202142436;3369.1071865955296;1042.1818872185297;1085.5711993762498;1108.296231892746;1116.7375666718315;1118.59730497021;11726.530938762438;11791.823122653168;11796.174267801258;11811.527538898434;11861.347625880488;4676.368690226844;4709.317149013374;4743.1225223333795;4774.761261936958;4798.184308667535;10032.1472674822;10044.447555384379;10046.748831279276;10053.79892402148;10081.747956301004;4503.099380123988;5294.708791016454;5334.733263336818;5336.199570064521;5336.466353364633;4714.929276060861;4793.304970779218;4826.107170173529;4836.830710925101;4865.197242455026;3866.439366291872;3947.3684210526176;3972.1261322509004;3987.5414327352146;4008.5189777226337;1259.420666493405;1262.5833474953242;1264.1214356022476;1280.4622058735354;1293.2434525802512;1445.9710805784036;1465.7874608181753;1466.8019817324525;1487.0705808869457;1489.7839813227238;7938.603069846485;7940.325072368913;7994.2405471480115;7994.36045116401;7997.440179187401;517.8834762178479;521.6113995073695;531.6889619572594;544.2679595943529;545.7816873250731;6056.9697151513965;6096.664683442454;6096.847578810476;6132.080187971751;6149.938500615026;9955.701328960144;10111.949440252898;10241.795164096677;10252.897471025344;10266.230032747573;9852.211823054282;9938.304318697621;10068.345557538736;10099;10120.595176193017;7930;7948.324392426593;7976.521408715495;8050.275475207142;8061.435699501096;7490.550566966;7565.2812982766545;7654.081510218809;7660.3488703460835;7675.270849269311;8832.51421171816;8903.73288801337;8958.372913895964;9117.908820911705;9250.583723732314;9305.022972587782;9321.347505674537;9340.813183736424;9367.625294988124;9524.095210954949;6294.748210071546;7485.663145158372;7552.9244707552225;7786.143524212219;8015;8116.472429292077;8122.390820688353;8144.918550814416;8159.632816523152;8218.465799722999;7030.3321184487395;7220.241874603091;7251.274872512707;7356.44826638015;7519.924800751923;7172.0676312079095;7220.0613920190035;7226.060612120391;7350.448716346403;7382.5570465772225;7575.545467271982;7604.201558836464;7649.120351159688;7654.8086297843;7666.38668906475;6942.2363540011565;6963.79108626742;7001.50989430735;7013.263607321362;7013.964930175316;7077.363037326665;7169.318914703095;7176.282371762782;7182.174049984319;7182.174049984319 09:11:02 INFO - PROCESS | 16481 | |4;prototype.html;369.7337916699976;369.92352254938135;370.6127097183442;373.64130434782606;379.0296840089373;5941.792037278696;6003.009503431934;6012.458878700916;6020.30766461857;6027.909581356278;5944.524438044957;5953.077273022677;5954.404559544044;5955.493783028448;5964.4035596440335;4473.127740090684;4541.727496350213;4626.537346265381;4643.721376717391;4682.016776476944;4667.836625718101;4677;4679.812807487697;4684;4689.015306785562;4622.930656040162;4634.953650463486;4638.9536104638855;4642.628589712815;4646.930296045562;4440.911181776362;4515.412996310475;4605.562471565196;4613.008203236287;4630.652701047401;4078.5309689385804;4092.7544347339253;4093.713440059197;4096;4098.426220329156;5677.176809362661;5692.886142277172;5702.657840529581;5716.942830571724;5720.914186287209;5361.35663720356;5369.436209198017;5370.3287089113865;5371.328583927009;5374.274472946141;6285.465735412496;6285.560010799246;6287.276963149251;6289.905651415233;6297.0554416837385;4314.56854314566;4411.9338209926555;4437.933430998538;4444.466664000308;4530.07133537624;6514;6557.180352455943;6561.80314590563;6572.671366431659;6579.47364210862;4505.797239124247;4510.345999830006;4517.661175411858;4521.073179998092;4526.6152377047665;4611.123886461562;4611.123886461562;4613.40025796651;4613.746243956614;4616.307553866947;5273.34083239595;5274.841754747364;5282.392524859613;5283.577313814885;5284.947150528523;6089.299730530957;6259.405356491126;6316.368363163739;6329.746810127635;6343;1596.9281382337822;1619.3198856480305;1626.7803846480574;1627.3327935546606;1633.7631043498627;1063.1494804156644;1083.7615724540588;1092.268180319188;1096.1833434091493;1117.9385133817555;6095.939040609625;6098.176746139215;6142.815715528542;6154.323024467305;6154.815355539341;6508.446782023487;6512.283648798629;6514.413702766679;6516.869662606721;6518.413342799171;6141.570090093651;6145.201123853871;6145.96927015371;6146.5390095743;6148.846278843064;3492.7555071145284;3520.2607452434763;3520.2607452434763;3522.4716292556323;3525.471179323122;6598.505112116611;6673.532852700265;6732.798016059526;6740.12378390806;6785.9660701696175;6607.57050791697;6627.933720662828;6631.3700198481065;6643.933560664428;6703.095082163943;6669.566478178903;6670.83322916931;6680.23177334603;6720.663966801738;6721.395074443323;6468.417842394207;6468.902966455601;6476.0933469313395;6477.190351206099;6490.967545162244;6295.811125666054;6382.393672601095;6386.074019267087;6451.1936007999;6480.287168411565;6832.658367081725;6850.38346548813;6868.416184624363;6878.312168783082;6882.311768823078;4578.5650363215445;4610.2854057621125;4611.2852507861335;4614.3770590971135;4616.6306695464955;6566.474682025522;6570.277269500256;6602.834929126618;6604.7027883746305;6604.867902642017;6321.715522801577;6404.9039264412;6416.7754128605275;6418.743250270124;6428.582142160744;6412.775552855627;6427.710753016032;6435.839104022437;6444.8388790280615;6447.2263328400895;6327.620342779448;6338.556301058881;6339.144215531029;6340.112384266298;6341.270753863365;6447.871042579216;6448.065030570635;6448.387403196689;6452;6454.386833250834;6026.427489388501;6135.355787642412;6139;6223.564350495421;6281.371862813865 09:11:02 INFO - PROCESS | 16481 | |5;yui.html;829.2660995019407;867.4578388507183;897.3987428422956;908.4095338030284;928.7260258223823;17083.658326833473;17575.1212439378;17606.295748170058;17608;17675.911620441897;16029.91985040073;16176.27206775695;16216.594585135377;16222.756658650129;16227.432039878606;773.404478551515;935.3546053223288;942.6276620734806;963.3449254506933;963.5712108111893;958.1711819276311;961.8028304197622;964.5129209749067;966.7051549277468;967.1730670276918;804.5172896262254;1008.188408331293;1012.3419777144841;1013.108464551194;1013.159077965287;987.2299606307092;1001.329109496639;1003.618624922532;1010.9292349535499;1011.7066050845247;744;744.6611791634793;745.5005146551823;745.8210029592913;746.4252525555346;14279;14399.352029158714;14437.06159099655;14460.638484037878;14468.638284042878;13949.511767088103;14061.226632535207;14284.642883927881;14404.855951440457;14530.05554638945;11600.129990250765;11744.882551174464;11753;11812.527498900034;12035.578754743541;3770.1140232045445;3809.9619003809885;3813.2945405100145;3843.0968722350226;3965.9008524786823;53380.46619533794;53441.73279133618;53448;53533.73233133809;53851.19223211655;9968.850467242997;10286.331388459726;10303.793924121475;10378.688639340831;10427.478626068667;19193.90403047976;19219.615607688047;19234.519137021685;19243.422697319103;19249.711254331196;8105.189481051965;8120.918790812135;8161.102278749333;8175.386845986456;8337.791555211046;4664.883377915511;4672.135654903854;4673;4728.219843725816;4763.809447622057;3324.1357247115925;3368.9663103369144;3430.554027976397;3534.91162720934;3537.3809583322814;592.7747455966705;596.0820336681462;656.6651007985866;676.9559978601375;694.2294053600499;646.2697152217963;647.2136354329513;658.3811217455576;695.0894328429773;715.6028404235595;8791;9187.862182067274;9406.811863762687;9521.095495927875;9906.356086854332;655.3839390972471;728.7959371376023;731.6524650790832;733.5232099135497;754.0649594502777;4184.309588917856;4293.8711838644895;4460.620847227957;4483.663725220622;4513.323001549794;61158.0826287606;61196;62043.689781550805;62109.06836397458;62431.37568624256;51368.229476557884;52765.208521872206;52882.471175287756;53162.46837531652;53485.465145348826;48934.510654893;49671.751641241564;49745.75127124414;51020;51618;8590.613422395882;8652.653893844428;8719.215270625675;8820.955895220482;8861.113888611088;35933.820330898176;36590.8170459146;36666;38396.6160338393;38418.231635367694;42823.57176428196;43138.13723725445;46193.53806461892;47423;47640.52359476499;11147.72130696739;11151.888481115086;11569.305841649528;11587.652370428901;11589.884101158881;12081.879181208076;12327.815082773945;12332.136750427384;12353.38233088324;12963.027772917258;10669.57321707123;11009.504572294105;11765.11761617865;11810.940945295219;12960.481580737041;11794.29234245948;11809.350485723024;12022.158448908493;12054;12332.876671233531;11614.6515604532;11635.53457861676;12212.08409369283;12243.387830608612;12444.128910976146;10177.949110254402;10182.643607473703;10211.744706382102;10246.129079028067;10402.063814256753;10162.441065741159;10164.33931794431;10181.236407269336;10216.591336346462;10355.741106472398 09:11:02 INFO - PROCESS | 16481 | __end_tp_report 09:11:02 INFO - PROCESS | 16481 | __start_cc_report 09:11:02 INFO - PROCESS | 16481 | _x_x_mozilla_cycle_collect,827 09:11:02 INFO - PROCESS | 16481 | __end_cc_report 09:11:02 INFO - PROCESS | 16481 | __startTimestamp1459527062407__endTimestamp 09:11:02 INFO - PROCESS | 16481 | 09:11:02 INFO - PROCESS | 16481 | ------- Summary: start ------- 09:11:02 INFO - PROCESS | 16481 | Number of tests: 6 09:11:02 INFO - PROCESS | 16481 | 09:11:02 INFO - PROCESS | 16481 | [#0] dojo.html Cycles:165 Average:5388.17 Median:5598.13 stddev:586.49 (10.5%) stddev-sans-first:562.98 09:11:02 INFO - PROCESS | 16481 | Values: 3215.7 3278.6 3320.7 3321.5 3359.0 5343.2 5354.1 5421.8 5438.1 5474.6 5400.2 5414.3 5455.0 5459.2 5461.2 4775.2 4985.9 5013.0 5069.2 5101.7 4868.7 4923.7 4960.3 4964.0 4971.9 4990.7 5045.5 5058.0 5071.1 5090.5 4957.4 5006.7 5017.6 5021.5 5026.6 4760.8 4860.1 4935.3 4960.3 4964.1 5226.4 5226.8 5243.0 5254.1 5258.7 5809.9 5830.7 5838.0 5843.0 5869.3 5568.5 5785.9 5794.2 5874.9 5881.4 5457.2 5458.8 5460.4 5465.8 5467.1 5747.1 5893.9 5948.5 5950.6 5962.9 5717.1 5779.9 5784.6 5806.9 5822.5 5811.4 5819.7 5835.7 5847.8 5848.8 5561.6 5748.4 5790.4 5798.4 5803.1 5789.5 5789.5 5791.9 5834.6 5858.0 4407.9 4441.7 4443.7 4447.5 4472.6 3891.3 3968.4 4006.8 4038.1 4042.3 5447.9 5474.6 5477.9 5479.6 5481.1 5772.6 5780.5 5781.8 5783.9 5788.8 5245.3 5444.4 5466.8 5479.8 5540.5 4875.3 4908.4 4908.9 4909.5 4941.6 5946.0 5950.4 5950.5 5951.3 5953.8 5531.4 5770.8 5838.1 5872.4 5881.9 5965.6 5967.7 5969.1 5969.8 5975.1 5523.5 5728.0 5732.7 5737.8 5739.1 5760.7 5787.6 5821.5 5824.1 5849.6 5632.0 5638.1 5638.5 5639.7 5644.6 5484.9 5633.7 5634.1 5642.9 5649.5 5606.7 5650.0 5652.2 5654.3 5688.1 5684.0 5696.9 5718.0 5724.4 5725.5 5340.5 5576.0 5598.1 5629.2 5644.1 09:11:02 INFO - PROCESS | 16481 | 09:11:02 INFO - PROCESS | 16481 | [#1] ext.html Cycles:180 Average:45756.69 Median:20560.07 stddev:70896.25 (344.8%) stddev-sans-first:71013.77 09:11:02 INFO - PROCESS | 16481 | Values: 521.7 553.7 555.5 556.9 583.5 30669.5 31422.8 31431.7 31448.2 31449.8 40694.6 41813.0 41869.4 41872.6 41966.2 8941.4 9191.8 9200.9 9206.2 9208.4 9046.4 9167.8 9189.0 9192.2 9197.2 9127.3 9256.2 9257.9 9458.7 9480.5 9304.2 9400.7 9404.9 9405.4 9410.1 9239.9 9384.8 9385.6 9386.7 9390.1 44913.3 45302.3 45372.0 45403.5 45455.3 3482.6 3706.5 3725.5 4210.3 4300.5 33435.5 33459.8 33680.2 34184.8 34291.5 4175.8 4277.1 4278.4 4302.0 4303.3 215776.0 215920.0 216288.0 217274.0 217438.0 64862.4 65637.7 65688.0 65700.3 65708.3 76834.6 77946.0 77966.2 78043.6 78050.2 15363.8 15389.7 15482.7 15501.0 15670.9 12711.1 12742.2 12789.1 12810.3 12868.7 22337.9 22686.8 22698.2 22833.0 24059.8 8584.2 9004.1 9066.4 9088.4 9136.2 1003.8 1085.7 1088.1 1209.4 1287.4 30697.4 30737.4 31088.2 31198.2 31668.5 1131.7 1151.2 1218.0 1242.8 1278.2 15980.9 16155.3 16419.5 16477.5 16528.3 342489.0 344257.0 344868.0 346997.0 347261.0 59749.4 60195.1 60289.4 60292.7 60297.0 1383.6 1454.7 1494.6 1529.5 1539.1 28004.5 28553.6 28590.4 29031.0 29039.9 49101.5 49607.0 49744.8 49764.0 49770.0 231871.0 232746.0 232802.0 232865.0 233066.0 30699.8 35435.5 35523.6 36062.6 36293.0 42318.2 42678.2 42943.6 43162.6 43337.8 35163.1 35686.5 35759.3 37692.2 39152.0 37394.6 38070.8 38590.4 38618.2 39082.4 38061.2 38387.2 38853.8 39270.2 39471.2 33468.0 34329.3 34409.5 34606.1 35107.0 26620.6 26627.0 26788.6 26789.9 26988.0 09:11:02 INFO - PROCESS | 16481 | 09:11:02 INFO - PROCESS | 16481 | [#2] jquery.html Cycles:180 Average:27065.46 Median:11527.15 stddev:77407.87 (671.5%) stddev-sans-first:77599.09 09:11:02 INFO - PROCESS | 16481 | Values: 383.5 384.1 389.9 395.5 404.6 14714.2 16803.5 17993.3 19402.9 19480.7 17457.5 17768.0 17992.7 17995.3 18032.5 5376.4 5422.4 5642.4 5660.2 5686.8 5500.6 5502.4 5520.9 5525.5 5531.3 5407.7 5493.8 5864.1 5873.0 5873.4 5725.2 5732.0 5745.5 5746.9 5747.8 5169.1 5357.4 5361.1 5366.1 5544.1 13745.9 13759.1 14951.6 20761.3 20761.6 2292.7 2407.8 2463.8 2488.4 2501.7 10218.1 10586.5 11601.1 11945.8 13582.7 1882.3 1925.4 1999.1 2019.1 2062.4 60828.4 62589.0 63087.4 63201.0 69542.7 10924.7 10980.8 11376.0 11467.1 11554.1 13756.7 14119.5 15284.7 15329.8 15344.8 6528.9 6677.8 7673.7 8096.1 8134.7 7750.1 7803.5 7822.7 7845.6 7855.9 4895.2 4935.9 4949.8 4953.8 4977.8 1846.5 1871.0 1971.9 2006.4 2010.8 917.5 981.3 1017.6 1021.8 1096.2 16679.4 16911.4 17367.4 17605.0 17765.9 1026.0 1030.4 1072.7 1079.8 1110.4 9745.4 10216.8 10315.6 10317.0 10345.6 465259.0 467971.0 472120.0 475199.0 479368.0 79728.6 79822.2 83681.6 84272.0 84921.6 1017.7 1032.7 1053.2 1053.6 1055.4 15358.4 15708.4 15744.6 15794.9 15883.4 29667.6 30238.4 35682.6 36346.8 37429.6 47843.0 53072.0 53303.2 54026.2 54307.0 11570.4 12050.7 12076.2 12140.5 12147.6 13428.2 13456.9 13511.0 13686.2 14077.5 8576.6 11419.3 11976.3 12101.5 12322.5 8785.9 8818.6 8824.3 8870.7 9048.3 8556.7 8652.2 8883.0 8940.9 9229.4 11706.3 11753.0 11784.2 12097.2 12207.8 11603.2 12048.2 12126.4 12275.3 12520.6 09:11:02 INFO - PROCESS | 16481 | 09:11:02 INFO - PROCESS | 16481 | [#3] mootools.html Cycles:180 Average:5903.31 Median:5323.71 stddev:3084.39 (57.9%) stddev-sans-first:3074.95 09:11:02 INFO - PROCESS | 16481 | Values: 1458.2 1592.1 1599.2 1858.3 1952.0 7772.8 7864.6 7908.1 7915.2 7968.5 8301.0 8443.5 8446.0 8456.0 8467.7 2123.0 2408.7 2416.0 2434.8 2480.3 2448.4 2457.0 2471.5 2472.2 2473.1 2423.0 2445.4 2450.8 2454.5 2455.5 2410.1 2450.6 2477.6 2478.4 2480.4 2446.7 2449.4 2461.5 2461.7 2463.4 8609.2 8689.0 8709.7 8713.4 8715.8 5120.6 5282.8 5316.4 5321.6 5325.8 3244.0 3322.7 3336.4 3366.4 3369.1 1042.2 1085.6 1108.3 1116.7 1118.6 11726.5 11791.8 11796.2 11811.5 11861.3 4676.4 4709.3 4743.1 4774.8 4798.2 10032.1 10044.4 10046.7 10053.8 10081.7 4503.1 5294.7 5334.7 5336.2 5336.5 4714.9 4793.3 4826.1 4836.8 4865.2 3866.4 3947.4 3972.1 3987.5 4008.5 1259.4 1262.6 1264.1 1280.5 1293.2 1446.0 1465.8 1466.8 1487.1 1489.8 7938.6 7940.3 7994.2 7994.4 7997.4 517.9 521.6 531.7 544.3 545.8 6057.0 6096.7 6096.8 6132.1 6149.9 9955.7 10111.9 10241.8 10252.9 10266.2 9852.2 9938.3 10068.3 10099.0 10120.6 7930.0 7948.3 7976.5 8050.3 8061.4 7490.6 7565.3 7654.1 7660.3 7675.3 8832.5 8903.7 8958.4 9117.9 9250.6 9305.0 9321.3 9340.8 9367.6 9524.1 6294.7 7485.7 7552.9 7786.1 8015.0 8116.5 8122.4 8144.9 8159.6 8218.5 7030.3 7220.2 7251.3 7356.4 7519.9 7172.1 7220.1 7226.1 7350.4 7382.6 7575.5 7604.2 7649.1 7654.8 7666.4 6942.2 6963.8 7001.5 7013.3 7014.0 7077.4 7169.3 7176.3 7182.2 7182.2 09:11:02 INFO - PROCESS | 16481 | 09:11:02 INFO - PROCESS | 16481 | [#4] prototype.html Cycles:180 Average:5324.61 Median:6058.60 stddev:1584.71 (26.2%) stddev-sans-first:1544.90 09:11:02 INFO - PROCESS | 16481 | Values: 369.7 369.9 370.6 373.6 379.0 5941.8 6003.0 6012.5 6020.3 6027.9 5944.5 5953.1 5954.4 5955.5 5964.4 4473.1 4541.7 4626.5 4643.7 4682.0 4667.8 4677.0 4679.8 4684.0 4689.0 4622.9 4635.0 4639.0 4642.6 4646.9 4440.9 4515.4 4605.6 4613.0 4630.7 4078.5 4092.8 4093.7 4096.0 4098.4 5677.2 5692.9 5702.7 5716.9 5720.9 5361.4 5369.4 5370.3 5371.3 5374.3 6285.5 6285.6 6287.3 6289.9 6297.1 4314.6 4411.9 4437.9 4444.5 4530.1 6514.0 6557.2 6561.8 6572.7 6579.5 4505.8 4510.3 4517.7 4521.1 4526.6 4611.1 4611.1 4613.4 4613.7 4616.3 5273.3 5274.8 5282.4 5283.6 5284.9 6089.3 6259.4 6316.4 6329.7 6343.0 1596.9 1619.3 1626.8 1627.3 1633.8 1063.1 1083.8 1092.3 1096.2 1117.9 6095.9 6098.2 6142.8 6154.3 6154.8 6508.4 6512.3 6514.4 6516.9 6518.4 6141.6 6145.2 6146.0 6146.5 6148.8 3492.8 3520.3 3520.3 3522.5 3525.5 6598.5 6673.5 6732.8 6740.1 6786.0 6607.6 6627.9 6631.4 6643.9 6703.1 6669.6 6670.8 6680.2 6720.7 6721.4 6468.4 6468.9 6476.1 6477.2 6491.0 6295.8 6382.4 6386.1 6451.2 6480.3 6832.7 6850.4 6868.4 6878.3 6882.3 4578.6 4610.3 4611.3 4614.4 4616.6 6566.5 6570.3 6602.8 6604.7 6604.9 6321.7 6404.9 6416.8 6418.7 6428.6 6412.8 6427.7 6435.8 6444.8 6447.2 6327.6 6338.6 6339.1 6340.1 6341.3 6447.9 6448.1 6448.4 6452.0 6454.4 6026.4 6135.4 6139.0 6223.6 6281.4 09:11:02 INFO - PROCESS | 16481 | 09:11:02 INFO - PROCESS | 16481 | [#5] yui.html Cycles:180 Average:14851.12 Median:3904.50 stddev:16976.25 (434.8%) stddev-sans-first:16991.22 09:11:02 INFO - PROCESS | 16481 | Values: 829.3 867.5 897.4 908.4 928.7 17083.7 17575.1 17606.3 17608.0 17675.9 16029.9 16176.3 16216.6 16222.8 16227.4 773.4 935.4 942.6 963.3 963.6 958.2 961.8 964.5 966.7 967.2 804.5 1008.2 1012.3 1013.1 1013.2 987.2 1001.3 1003.6 1010.9 1011.7 744.0 744.7 745.5 745.8 746.4 14279.0 14399.4 14437.1 14460.6 14468.6 13949.5 14061.2 14284.6 14404.9 14530.1 11600.1 11744.9 11753.0 11812.5 12035.6 3770.1 3810.0 3813.3 3843.1 3965.9 53380.5 53441.7 53448.0 53533.7 53851.2 9968.9 10286.3 10303.8 10378.7 10427.5 19193.9 19219.6 19234.5 19243.4 19249.7 8105.2 8120.9 8161.1 8175.4 8337.8 4664.9 4672.1 4673.0 4728.2 4763.8 3324.1 3369.0 3430.6 3534.9 3537.4 592.8 596.1 656.7 677.0 694.2 646.3 647.2 658.4 695.1 715.6 8791.0 9187.9 9406.8 9521.1 9906.4 655.4 728.8 731.7 733.5 754.1 4184.3 4293.9 4460.6 4483.7 4513.3 61158.1 61196.0 62043.7 62109.1 62431.4 51368.2 52765.2 52882.5 53162.5 53485.5 48934.5 49671.8 49745.8 51020.0 51618.0 8590.6 8652.7 8719.2 8821.0 8861.1 35933.8 36590.8 36666.0 38396.6 38418.2 42823.6 43138.1 46193.5 47423.0 47640.5 11147.7 11151.9 11569.3 11587.7 11589.9 12081.9 12327.8 12332.1 12353.4 12963.0 10669.6 11009.5 11765.1 11810.9 12960.5 11794.3 11809.4 12022.2 12054.0 12332.9 11614.7 11635.5 12212.1 12243.4 12444.1 10177.9 10182.6 10211.7 10246.1 10402.1 10162.4 10164.3 10181.2 10216.6 10355.7 09:11:02 INFO - PROCESS | 16481 | -------- Summary: end -------- 09:11:02 INFO - PROCESS | 16481 | 09:11:03 INFO - TEST-INFO | 16481: exit 0 09:11:03 INFO - TEST-OK | dromaeo_css | took 1111076ms 09:11:03 INFO - TEST-START | kraken 09:11:03 INFO - operating with platform_type : linux_ 09:11:03 INFO - Initialising browser for kraken test... 09:11:03 INFO - TEST-INFO | started process 16673 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpdLSSSt/profile http://localhost:35178/getInfo.html) 09:11:07 INFO - PROCESS | 16673 | __metrics Screen width/height:1600/1200 09:11:07 INFO - PROCESS | 16673 | colorDepth:24 09:11:07 INFO - PROCESS | 16673 | Browser inner width/height: 1024/697 09:11:07 INFO - PROCESS | 16673 | __metrics 09:11:08 INFO - PROCESS | 16673 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:11:09 INFO - TEST-INFO | 16673: exit 0 09:11:09 INFO - Browser initialized. 09:11:09 INFO - Running cycle 1/1 for kraken test... 09:11:09 INFO - TEST-INFO | started process 16767 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpdLSSSt/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:11:20 INFO - PROCESS | 16767 | RSS: Main: 144683008 09:11:20 INFO - PROCESS | 16767 | 09:11:23 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:35178/tests/kraken/driver.html?testName=audio-beat-detection) 09:11:23 INFO - PROCESS | 16767 | RSS: Main: 179806208 09:11:23 INFO - PROCESS | 16767 | 09:11:26 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:35178/tests/kraken/driver.html?testName=audio-dft) 09:11:27 INFO - PROCESS | 16767 | RSS: Main: 177717248 09:11:27 INFO - PROCESS | 16767 | 09:11:29 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:35178/tests/kraken/driver.html?testName=audio-fft) 09:11:30 INFO - PROCESS | 16767 | RSS: Main: 173174784 09:11:30 INFO - PROCESS | 16767 | 09:11:32 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:35178/tests/kraken/driver.html?testName=audio-oscillator) 09:11:33 INFO - PROCESS | 16767 | RSS: Main: 173375488 09:11:33 INFO - PROCESS | 16767 | 09:11:35 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:35178/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:11:35 INFO - PROCESS | 16767 | RSS: Main: 172761088 09:11:35 INFO - PROCESS | 16767 | 09:11:38 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:35178/tests/kraken/driver.html?testName=imaging-darkroom) 09:11:39 INFO - PROCESS | 16767 | RSS: Main: 173907968 09:11:39 INFO - PROCESS | 16767 | 09:11:42 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:35178/tests/kraken/driver.html?testName=imaging-desaturate) 09:11:43 INFO - PROCESS | 16767 | RSS: Main: 174096384 09:11:43 INFO - PROCESS | 16767 | 09:11:46 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:35178/tests/kraken/driver.html?testName=json-parse-financial) 09:11:46 INFO - PROCESS | 16767 | RSS: Main: 174075904 09:11:46 INFO - PROCESS | 16767 | 09:11:48 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:35178/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:11:48 INFO - PROCESS | 16767 | RSS: Main: 178544640 09:11:48 INFO - PROCESS | 16767 | 09:11:50 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:35178/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:11:51 INFO - PROCESS | 16767 | RSS: Main: 175140864 09:11:51 INFO - PROCESS | 16767 | 09:11:53 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:35178/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:11:53 INFO - PROCESS | 16767 | RSS: Main: 182579200 09:11:53 INFO - PROCESS | 16767 | 09:11:56 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:35178/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:11:56 INFO - PROCESS | 16767 | RSS: Main: 189837312 09:11:56 INFO - PROCESS | 16767 | 09:11:59 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:35178/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:11:59 INFO - PROCESS | 16767 | RSS: Main: 189538304 09:11:59 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | Cycle 1(1): loaded http://localhost:35178/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:35178/tests/kraken/driver.html?testName=ai-astar) 09:12:01 INFO - PROCESS | 16767 | RSS: Main: 249167872 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | __start_tp_report 09:12:01 INFO - PROCESS | 16767 | _x_x_mozilla_page_load 09:12:01 INFO - PROCESS | 16767 | _x_x_mozilla_page_load_details 09:12:01 INFO - PROCESS | 16767 | |i|pagename|runs| 09:12:01 INFO - PROCESS | 16767 | |0;ai-astar;110;109;104;109;111;111;99;109;110;108 09:12:01 INFO - PROCESS | 16767 | |1;audio-beat-detection;148;126;148;158;127;154;153;140;171;127 09:12:01 INFO - PROCESS | 16767 | |2;audio-dft;161;163;161;160;161;162;159;164;159;162 09:12:01 INFO - PROCESS | 16767 | |3;audio-fft;75;76;75;171;76;76;76;73;156;72 09:12:01 INFO - PROCESS | 16767 | |4;audio-oscillator;94;93;151;93;94;94;147;92;93;141 09:12:01 INFO - PROCESS | 16767 | |5;imaging-gaussian-blur;116;116;116;116;117;116;116;117;116;116 09:12:01 INFO - PROCESS | 16767 | |6;imaging-darkroom;146;145;146;145;145;145;145;145;146;145 09:12:01 INFO - PROCESS | 16767 | |7;imaging-desaturate;95;96;96;96;95;96;96;95;95;95 09:12:01 INFO - PROCESS | 16767 | |8;json-parse-financial;53;54;54;54;55;54;56;62;54;52 09:12:01 INFO - PROCESS | 16767 | |9;json-stringify-tinderbox;65;64;64;66;65;66;65;65;65;65 09:12:01 INFO - PROCESS | 16767 | |10;stanford-crypto-aes;75;79;78;77;76;84;76;76;78;78 09:12:01 INFO - PROCESS | 16767 | |11;stanford-crypto-ccm;113;109;113;116;112;110;110;113;112;109 09:12:01 INFO - PROCESS | 16767 | |12;stanford-crypto-pbkdf2;152;142;141;139;140;129;147;144;140;151 09:12:01 INFO - PROCESS | 16767 | |13;stanford-crypto-sha256-iterative;67;68;65;64;64;65;65;66;63;64 09:12:01 INFO - PROCESS | 16767 | __end_tp_report 09:12:01 INFO - PROCESS | 16767 | __start_cc_report 09:12:01 INFO - PROCESS | 16767 | _x_x_mozilla_cycle_collect,1056 09:12:01 INFO - PROCESS | 16767 | __end_cc_report 09:12:01 INFO - PROCESS | 16767 | __startTimestamp1459527121695__endTimestamp 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | ------- Summary: start ------- 09:12:01 INFO - PROCESS | 16767 | Number of tests: 14 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#0] ai-astar Cycles:10 Average:108.00 Median:110.00 stddev:3.74 (3.4%) stddev-sans-first:3.90 09:12:01 INFO - PROCESS | 16767 | Values: 110.0 109.0 104.0 109.0 111.0 111.0 99.0 109.0 110.0 108.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#1] audio-beat-detection Cycles:10 Average:145.20 Median:150.50 stddev:15.06 (10.0%) stddev-sans-first:15.94 09:12:01 INFO - PROCESS | 16767 | Values: 148.0 126.0 148.0 158.0 127.0 154.0 153.0 140.0 171.0 127.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#2] audio-dft Cycles:10 Average:161.20 Median:161.50 stddev:1.62 (1.0%) stddev-sans-first:1.72 09:12:01 INFO - PROCESS | 16767 | Values: 161.0 163.0 161.0 160.0 161.0 162.0 159.0 164.0 159.0 162.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#3] audio-fft Cycles:10 Average:92.60 Median:75.50 stddev:37.56 (49.7%) stddev-sans-first:39.29 09:12:01 INFO - PROCESS | 16767 | Values: 75.0 76.0 75.0 171.0 76.0 76.0 76.0 73.0 156.0 72.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#4] audio-oscillator Cycles:10 Average:109.20 Median:93.00 stddev:25.74 (27.7%) stddev-sans-first:26.71 09:12:01 INFO - PROCESS | 16767 | Values: 94.0 93.0 151.0 93.0 94.0 94.0 147.0 92.0 93.0 141.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#5] imaging-gaussian-blur Cycles:10 Average:116.20 Median:116.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 09:12:01 INFO - PROCESS | 16767 | Values: 116.0 116.0 116.0 116.0 117.0 116.0 116.0 117.0 116.0 116.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#6] imaging-darkroom Cycles:10 Average:145.30 Median:145.00 stddev:0.48 (0.3%) stddev-sans-first:0.44 09:12:01 INFO - PROCESS | 16767 | Values: 146.0 145.0 146.0 145.0 145.0 145.0 145.0 145.0 146.0 145.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:96.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 09:12:01 INFO - PROCESS | 16767 | Values: 95.0 96.0 96.0 96.0 95.0 96.0 96.0 95.0 95.0 95.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#8] json-parse-financial Cycles:10 Average:54.80 Median:54.00 stddev:2.74 (5.1%) stddev-sans-first:2.83 09:12:01 INFO - PROCESS | 16767 | Values: 53.0 54.0 54.0 54.0 55.0 54.0 56.0 62.0 54.0 52.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#9] json-stringify-tinderbox Cycles:10 Average:65.00 Median:65.00 stddev:0.67 (1.0%) stddev-sans-first:0.71 09:12:01 INFO - PROCESS | 16767 | Values: 65.0 64.0 64.0 66.0 65.0 66.0 65.0 65.0 65.0 65.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#10] stanford-crypto-aes Cycles:10 Average:77.70 Median:78.00 stddev:2.54 (3.3%) stddev-sans-first:2.50 09:12:01 INFO - PROCESS | 16767 | Values: 75.0 79.0 78.0 77.0 76.0 84.0 76.0 76.0 78.0 78.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#11] stanford-crypto-ccm Cycles:10 Average:111.70 Median:112.50 stddev:2.21 (2.0%) stddev-sans-first:2.30 09:12:01 INFO - PROCESS | 16767 | Values: 113.0 109.0 113.0 116.0 112.0 110.0 110.0 113.0 112.0 109.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:142.50 Median:143.00 stddev:6.62 (4.6%) stddev-sans-first:6.06 09:12:01 INFO - PROCESS | 16767 | Values: 152.0 142.0 141.0 139.0 140.0 129.0 147.0 144.0 140.0 151.0 09:12:01 INFO - PROCESS | 16767 | 09:12:01 INFO - PROCESS | 16767 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.10 Median:65.00 stddev:1.52 (2.3%) stddev-sans-first:1.45 09:12:01 INFO - PROCESS | 16767 | Values: 67.0 68.0 65.0 64.0 64.0 65.0 65.0 66.0 63.0 64.0 09:12:01 INFO - PROCESS | 16767 | -------- Summary: end -------- 09:12:01 INFO - PROCESS | 16767 | 09:12:02 INFO - TEST-INFO | 16767: exit 0 09:12:02 INFO - TEST-OK | kraken | took 59526ms 09:12:02 INFO - SUITE-END | took 1170s 09:12:02 INFO - Completed test suite (00:19:30) 09:12:02 INFO - javascript benchmark 09:12:02 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3215.6623554526773, 3278.5573947517078, 3320.6679332066783, 3321.485169798682, 3358.9755124686967, 5343.225232341313, 5354.116570765824, 5421.783128674848, 5438.129899216126, 5474.644148130369, 5400.216968539569, 5414.269073675063, 5454.972725136378, 5459.181122831567, 5461.18082287657, 4775.235962246042, 4985.900281994358, 5012.974935125338, 5069.214271787879, 5101.744912754366, 4868.707877527359, 4923.679960802554, 4960.305557221974, 4964.0, 4971.850844474671, 4990.65065445419, 5045.495450454961, 5058.0, 5071.087204303224, 5090.516400941905, 4957.380327459067, 5006.724630145341, 5017.623678224148, 5021.472745361739, 5026.623003274751, 4760.785764640599, 4860.149473842099, 4935.3090567320605, 4960.280759289919, 4964.05682920244, 5226.425093239779, 5226.817061402832, 5243.030039442715, 5254.133068043769, 5258.7370631468275, 5809.941900580982, 5830.679312637803, 5838.0, 5843.0, 5869.325027621835, 5568.52667523261, 5785.855353616151, 5794.246747922785, 5874.853128671817, 5881.441263080001, 5457.208704737831, 5458.754356053947, 5460.372057213472, 5465.781368745245, 5467.125259958428, 5747.051736463521, 5893.911591326134, 5948.494377977834, 5950.642961422329, 5962.880742385128, 5717.085266357363, 5779.942200577941, 5784.59507834456, 5806.854828629233, 5822.475977162076, 5811.4479124483105, 5819.70901454934, 5835.708214589254, 5847.795327163529, 5848.795292164754, 5561.555075593943, 5748.367679555246, 5790.42095790426, 5798.362180160179, 5803.100519419497, 5789.45000224978, 5789.507891829242, 5791.913121303184, 5834.591578589543, 5858.033424484912, 4407.889802754957, 4441.689081764245, 4443.688941774045, 4447.510773814878, 4472.619827314649, 3891.280113179071, 3968.3650615901315, 4006.7996600169877, 4038.1116154445976, 4042.312806822847, 5447.918281225785, 5474.644148130359, 5477.917831232535, 5479.6164268500825, 5481.12302031681, 5772.5670574707065, 5780.450857168562, 5781.82654520365, 5783.88432231353, 5788.797392091341, 5245.318108645852, 5444.40111587725, 5466.835994920159, 5479.835604931858, 5540.473655002768, 4875.268709693574, 4908.386451693538, 4908.852734417973, 4909.533594308535, 4941.579965702956, 5946.0, 5950.434708702666, 5950.5239580834295, 5951.256092988377, 5953.76184952597, 5531.391546929915, 5770.798022069207, 5838.065909454467, 5872.354041055395, 5881.941180588139, 5965.642061476152, 5967.731452084753, 5969.134475500941, 5969.791057312973, 5975.133605627247, 5523.530499907552, 5728.0, 5732.684702341245, 5737.770489180386, 5739.110437882135, 5760.711964401679, 5787.565932554991, 5821.476067153807, 5824.097264923944, 5849.5612829037145, 5632.014397480507, 5638.126090455986, 5638.548916086621, 5639.661620302795, 5644.604877658525, 5484.917726234189, 5633.690147041952, 5634.126710359901, 5642.887142257214, 5649.491545760901, 5606.747696353756, 5650.039493286069, 5652.236948011966, 5654.321481422256, 5688.089905615082, 5684.033714268501, 5696.886062278814, 5718.027935250934, 5724.427557244242, 5725.541956643375, 5340.49265319794, 5576.024195765806, 5598.1322894951345, 5629.211910332475, 5644.068728659725], "unit": "score", "name": "dojo.html", "value": 5351.084519380625}, {"lowerIsBetter": false, "replicates": [521.6922016010556, 553.676099481803, 555.5250261026822, 556.9415211402805, 583.4807021750643, 30669.539956900637, 31422.84288578557, 31431.68568314316, 31448.213794655145, 31449.842750786273, 40694.59305406945, 41813.0, 41869.371959420634, 41872.58127418725, 41966.16067678652, 8941.37410381272, 9191.816163676756, 9200.907990920106, 9206.171444569987, 9208.401453905508, 9046.3667543272, 9167.770805729844, 9189.0, 9192.172704456598, 9197.218236449877, 9127.315451341143, 9256.213221876149, 9257.861132083024, 9458.716238512821, 9480.525973701322, 9304.162625363715, 9400.670976515788, 9404.858927116098, 9405.388649737744, 9410.106039926197, 9239.907600923972, 9384.812303753955, 9385.624575016991, 9386.718398448058, 9390.107939745712, 44913.326300105524, 45302.32046519305, 45372.0, 45403.54596454059, 45455.318170227474, 3482.564679415073, 3706.4810926470313, 3725.515682961198, 4210.32634778437, 4300.548442413533, 33435.49846752301, 33459.83270083634, 33680.15799605005, 34184.82907585446, 34291.48562771561, 4175.832966681329, 4277.101808620194, 4278.443802305712, 4301.956980430218, 4303.268444364466, 215776.0, 215920.0, 216288.0, 217274.0, 217438.0, 64862.35137648563, 65637.67181164064, 65688.0, 65700.34299657038, 65708.34291657117, 76834.6158269205, 77946.0, 77966.2203377959, 78043.60978195186, 78050.21949780543, 15363.769543456858, 15389.692206155814, 15482.690346193012, 15501.0, 15670.9216453917, 12711.110222284351, 12742.171758835646, 12789.10476266671, 12810.295433751233, 12868.742625147444, 22337.888310558345, 22686.773132268467, 22698.205562805553, 22833.0, 24059.759402406104, 8584.184502472255, 9004.099590040943, 9066.36535442526, 9088.409253398508, 9136.223421009288, 1003.7942221844504, 1085.6742977106837, 1088.0751361342795, 1209.4194786502528, 1287.3627554360464, 30697.38605227883, 30737.38525229483, 31088.22279443032, 31198.220044498616, 31668.524972125437, 1131.666361390673, 1151.1826603111717, 1218.031664826465, 1242.8322176506238, 1278.1500302299053, 15980.92009539968, 16155.273012714457, 16419.507414777574, 16477.505674829776, 16528.338866445207, 342489.0, 344257.0, 344868.0, 346997.0, 347261.0, 59749.40250597525, 60195.09707354393, 60289.39710602925, 60292.698536507036, 60297.0, 1383.5918404070824, 1454.6508837879044, 1494.5516345096428, 1529.4723320454425, 1539.1073177557214, 28004.52666896053, 28553.571696424155, 28590.42819143564, 29030.983915562854, 29039.85480072586, 49101.508984911125, 49607.0, 49744.75127624339, 49764.0, 49770.0, 231871.0, 232746.0, 232802.0, 232865.0, 233066.0, 30699.846500767355, 35435.468467973515, 35523.644763553064, 36062.639373605925, 36293.0, 42318.1536369277, 42678.22591531541, 42943.57056429521, 43162.56837431585, 43337.78331108324, 35163.120921977155, 35686.464703028956, 35759.28481430409, 37692.246155076195, 39152.0, 37394.626053740205, 38070.809645951595, 38590.4211436823, 38618.22763544769, 39082.413763792996, 38061.2387752249, 38387.232255354174, 38853.805730971166, 39270.214595708494, 39471.2105757889, 33468.0, 34329.31341373209, 34409.48385774165, 34606.134846628025, 35107.0, 26620.600690989264, 26627.0, 26788.59817102784, 26789.86605066962, 26988.0], "unit": "score", "name": "ext.html", "value": 19543.83256638207}, {"lowerIsBetter": false, "replicates": [383.54358313606804, 384.126113092714, 389.89862635714724, 395.54314766444764, 404.56307188236707, 14714.190719510423, 16803.49589512315, 17993.280268789233, 19402.90298548507, 19480.70778938317, 17457.476275711717, 17768.0, 17992.730109048374, 17995.280188792432, 18032.4590262292, 5376.381716102659, 5422.376426710929, 5642.379338272786, 5660.179274005287, 5686.800961966332, 5500.5874559408, 5502.422245664207, 5520.944790552083, 5525.475079867406, 5531.2532808071, 5407.675539467625, 5493.835184944458, 5864.1203819427, 5872.9706351468185, 5873.353931067579, 5725.198472213893, 5731.971340143294, 5745.511631511285, 5746.856328591777, 5747.798827041075, 5169.095408303532, 5357.4106848246665, 5361.0618141825025, 5366.060939335601, 5544.085225937715, 13745.931270343684, 13759.10565813229, 14951.551453456414, 20761.273355432637, 20761.5847683047, 2292.713410823647, 2407.8073754099805, 2463.802895768334, 2488.35302821266, 2501.6997960244703, 10218.080372766486, 10586.470676466222, 11601.12991525639, 11945.761084778344, 13582.728345433135, 1882.3035476873508, 1925.422373288008, 1999.1103958738368, 2019.0914088660015, 2062.4019034479984, 60828.39171608272, 62589.0, 63087.36912630861, 63201.0, 69542.65228673824, 10924.726881828017, 10980.780384392427, 11376.0, 11467.139964502696, 11554.075673946065, 13756.724865502634, 14119.505817296345, 15284.694306113815, 15329.770053449207, 15344.846551534341, 6528.934710652833, 6677.766278180337, 7673.693052277847, 8096.149904260085, 8134.674613015532, 7750.14748377678, 7803.4783217273225, 7822.687092516349, 7845.5684937329, 7855.8821617675785, 4895.241237608177, 4935.87660308488, 4949.752512374367, 4953.826616068421, 4977.776000080005, 1846.4737549798242, 1871.0457666590137, 1971.8816870987787, 2006.428167972121, 2010.7989201079774, 917.5366439947784, 981.259149342242, 1017.5624481472889, 1021.8416145497459, 1096.2107282756403, 16679.416220432227, 16911.40810071666, 17367.392141274995, 17605.0, 17765.911170444324, 1026.0, 1030.3766221435924, 1072.6621114349111, 1079.794838980591, 1110.4225802582612, 9745.415275083376, 10216.846747298796, 10315.587376504856, 10317.0, 10345.586176552853, 465259.0, 467971.0, 472120.0, 475199.0, 479368.0, 79728.60135699285, 79822.20177798264, 83681.58159209165, 84272.0, 84921.57539212264, 1017.704865588971, 1032.695354870315, 1053.1890444357803, 1053.636495409098, 1055.4036969112426, 15358.385664573292, 15708.371665133724, 15744.60638484047, 15794.9210253948, 15883.364665413716, 29667.55498667565, 30238.395232095674, 35682.64317356793, 36346.8182659085, 37429.6257037437, 47843.0, 53072.0, 53303.200451994024, 54026.18960715514, 54307.0, 11570.421478925851, 12050.674425812978, 12076.21504602198, 12140.514379424723, 12147.635570932885, 13428.19430834153, 13456.86543134556, 13511.0, 13686.178829270275, 14077.507287244896, 8576.571171441528, 11419.257748246337, 11976.341301228516, 12101.515939362327, 12322.50709971627, 8785.912140878509, 8818.647254109765, 8824.338174637056, 8870.689525866565, 9048.321375896703, 8556.700515481929, 8652.178043085896, 8882.955585222033, 8940.86588701157, 9229.446233226028, 11706.297622142698, 11753.0, 11784.234024788362, 12097.2136811107, 12207.75584488323, 11603.187776855877, 12048.216865903689, 12126.393680316125, 12275.324857132944, 12520.561780337644], "unit": "score", "name": "jquery.html", "value": 8922.22631383878}, {"lowerIsBetter": false, "replicates": [1458.212565214784, 1592.1163754116465, 1599.1604407685968, 1858.3031363238786, 1951.9902400487995, 7772.844543109141, 7864.567448790314, 7908.0905695844995, 7915.1689072647405, 7968.521888686676, 8301.045379781326, 8443.493390396581, 8446.0, 8455.957720211405, 8467.661293548266, 2122.9893850530802, 2408.6748288980984, 2416.0, 2434.793042591373, 2480.293116461809, 2448.375664205634, 2456.9631455528183, 2471.480988992314, 2472.184179220862, 2473.109680515013, 2422.9515409691794, 2445.3519817248443, 2450.754924507544, 2454.509098180371, 2455.533448644761, 2410.120306088274, 2450.6079027355627, 2477.6283557466345, 2478.4423504711294, 2480.3923038855414, 2446.694163229596, 2449.4243852694603, 2461.507698460297, 2461.7045954485397, 2463.4334103156193, 8609.182127697859, 8688.956555217246, 8709.738707838775, 8713.390062695615, 8715.825683486295, 5120.590352771769, 5282.81510147143, 5316.415194328621, 5321.574274058066, 5325.840224793263, 3243.9837800810847, 3322.7175690066374, 3336.432806422914, 3366.3772202142436, 3369.1071865955296, 1042.1818872185297, 1085.5711993762498, 1108.296231892746, 1116.7375666718315, 1118.59730497021, 11726.530938762438, 11791.823122653168, 11796.174267801258, 11811.527538898434, 11861.347625880488, 4676.368690226844, 4709.317149013374, 4743.1225223333795, 4774.761261936958, 4798.184308667535, 10032.1472674822, 10044.447555384379, 10046.748831279276, 10053.79892402148, 10081.747956301004, 4503.099380123988, 5294.708791016454, 5334.733263336818, 5336.199570064521, 5336.466353364633, 4714.929276060861, 4793.304970779218, 4826.107170173529, 4836.830710925101, 4865.197242455026, 3866.439366291872, 3947.3684210526176, 3972.1261322509004, 3987.5414327352146, 4008.5189777226337, 1259.420666493405, 1262.5833474953242, 1264.1214356022476, 1280.4622058735354, 1293.2434525802512, 1445.9710805784036, 1465.7874608181753, 1466.8019817324525, 1487.0705808869457, 1489.7839813227238, 7938.603069846485, 7940.325072368913, 7994.2405471480115, 7994.36045116401, 7997.440179187401, 517.8834762178479, 521.6113995073695, 531.6889619572594, 544.2679595943529, 545.7816873250731, 6056.9697151513965, 6096.664683442454, 6096.847578810476, 6132.080187971751, 6149.938500615026, 9955.701328960144, 10111.949440252898, 10241.795164096677, 10252.897471025344, 10266.230032747573, 9852.211823054282, 9938.304318697621, 10068.345557538736, 10099.0, 10120.595176193017, 7930.0, 7948.324392426593, 7976.521408715495, 8050.275475207142, 8061.435699501096, 7490.550566966, 7565.2812982766545, 7654.081510218809, 7660.3488703460835, 7675.270849269311, 8832.51421171816, 8903.73288801337, 8958.372913895964, 9117.908820911705, 9250.583723732314, 9305.022972587782, 9321.347505674537, 9340.813183736424, 9367.625294988124, 9524.095210954949, 6294.748210071546, 7485.663145158372, 7552.9244707552225, 7786.143524212219, 8015.0, 8116.472429292077, 8122.390820688353, 8144.918550814416, 8159.632816523152, 8218.465799722999, 7030.3321184487395, 7220.241874603091, 7251.274872512707, 7356.44826638015, 7519.924800751923, 7172.0676312079095, 7220.0613920190035, 7226.060612120391, 7350.448716346403, 7382.5570465772225, 7575.545467271982, 7604.201558836464, 7649.120351159688, 7654.8086297843, 7666.38668906475, 6942.2363540011565, 6963.79108626742, 7001.50989430735, 7013.263607321362, 7013.964930175316, 7077.363037326665, 7169.318914703095, 7176.282371762782, 7182.174049984319, 7182.174049984319], "unit": "score", "name": "mootools.html", "value": 4775.262823063408}, {"lowerIsBetter": false, "replicates": [369.7337916699976, 369.92352254938135, 370.6127097183442, 373.64130434782606, 379.0296840089373, 5941.792037278696, 6003.009503431934, 6012.458878700916, 6020.30766461857, 6027.909581356278, 5944.524438044957, 5953.077273022677, 5954.404559544044, 5955.493783028448, 5964.4035596440335, 4473.127740090684, 4541.727496350213, 4626.537346265381, 4643.721376717391, 4682.016776476944, 4667.836625718101, 4677.0, 4679.812807487697, 4684.0, 4689.015306785562, 4622.930656040162, 4634.953650463486, 4638.9536104638855, 4642.628589712815, 4646.930296045562, 4440.911181776362, 4515.412996310475, 4605.562471565196, 4613.008203236287, 4630.652701047401, 4078.5309689385804, 4092.7544347339253, 4093.713440059197, 4096.0, 4098.426220329156, 5677.176809362661, 5692.886142277172, 5702.657840529581, 5716.942830571724, 5720.914186287209, 5361.35663720356, 5369.436209198017, 5370.3287089113865, 5371.328583927009, 5374.274472946141, 6285.465735412496, 6285.560010799246, 6287.276963149251, 6289.905651415233, 6297.0554416837385, 4314.56854314566, 4411.9338209926555, 4437.933430998538, 4444.466664000308, 4530.07133537624, 6514.0, 6557.180352455943, 6561.80314590563, 6572.671366431659, 6579.47364210862, 4505.797239124247, 4510.345999830006, 4517.661175411858, 4521.073179998092, 4526.6152377047665, 4611.123886461562, 4611.123886461562, 4613.40025796651, 4613.746243956614, 4616.307553866947, 5273.34083239595, 5274.841754747364, 5282.392524859613, 5283.577313814885, 5284.947150528523, 6089.299730530957, 6259.405356491126, 6316.368363163739, 6329.746810127635, 6343.0, 1596.9281382337822, 1619.3198856480305, 1626.7803846480574, 1627.3327935546606, 1633.7631043498627, 1063.1494804156644, 1083.7615724540588, 1092.268180319188, 1096.1833434091493, 1117.9385133817555, 6095.939040609625, 6098.176746139215, 6142.815715528542, 6154.323024467305, 6154.815355539341, 6508.446782023487, 6512.283648798629, 6514.413702766679, 6516.869662606721, 6518.413342799171, 6141.570090093651, 6145.201123853871, 6145.96927015371, 6146.5390095743, 6148.846278843064, 3492.7555071145284, 3520.2607452434763, 3520.2607452434763, 3522.4716292556323, 3525.471179323122, 6598.505112116611, 6673.532852700265, 6732.798016059526, 6740.12378390806, 6785.9660701696175, 6607.57050791697, 6627.933720662828, 6631.3700198481065, 6643.933560664428, 6703.095082163943, 6669.566478178903, 6670.83322916931, 6680.23177334603, 6720.663966801738, 6721.395074443323, 6468.417842394207, 6468.902966455601, 6476.0933469313395, 6477.190351206099, 6490.967545162244, 6295.811125666054, 6382.393672601095, 6386.074019267087, 6451.1936007999, 6480.287168411565, 6832.658367081725, 6850.38346548813, 6868.416184624363, 6878.312168783082, 6882.311768823078, 4578.5650363215445, 4610.2854057621125, 4611.2852507861335, 4614.3770590971135, 4616.6306695464955, 6566.474682025522, 6570.277269500256, 6602.834929126618, 6604.7027883746305, 6604.867902642017, 6321.715522801577, 6404.9039264412, 6416.7754128605275, 6418.743250270124, 6428.582142160744, 6412.775552855627, 6427.710753016032, 6435.839104022437, 6444.8388790280615, 6447.2263328400895, 6327.620342779448, 6338.556301058881, 6339.144215531029, 6340.112384266298, 6341.270753863365, 6447.871042579216, 6448.065030570635, 6448.387403196689, 6452.0, 6454.386833250834, 6026.427489388501, 6135.355787642412, 6139.0, 6223.564350495421, 6281.371862813865], "unit": "score", "name": "prototype.html", "value": 4820.262100673605}, {"lowerIsBetter": false, "replicates": [829.2660995019407, 867.4578388507183, 897.3987428422956, 908.4095338030284, 928.7260258223823, 17083.658326833473, 17575.1212439378, 17606.295748170058, 17608.0, 17675.911620441897, 16029.91985040073, 16176.27206775695, 16216.594585135377, 16222.756658650129, 16227.432039878606, 773.404478551515, 935.3546053223288, 942.6276620734806, 963.3449254506933, 963.5712108111893, 958.1711819276311, 961.8028304197622, 964.5129209749067, 966.7051549277468, 967.1730670276918, 804.5172896262254, 1008.188408331293, 1012.3419777144841, 1013.108464551194, 1013.159077965287, 987.2299606307092, 1001.329109496639, 1003.618624922532, 1010.9292349535499, 1011.7066050845247, 744.0, 744.6611791634793, 745.5005146551823, 745.8210029592913, 746.4252525555346, 14279.0, 14399.352029158714, 14437.06159099655, 14460.638484037878, 14468.638284042878, 13949.511767088103, 14061.226632535207, 14284.642883927881, 14404.855951440457, 14530.05554638945, 11600.129990250765, 11744.882551174464, 11753.0, 11812.527498900034, 12035.578754743541, 3770.1140232045445, 3809.9619003809885, 3813.2945405100145, 3843.0968722350226, 3965.9008524786823, 53380.46619533794, 53441.73279133618, 53448.0, 53533.73233133809, 53851.19223211655, 9968.850467242997, 10286.331388459726, 10303.793924121475, 10378.688639340831, 10427.478626068667, 19193.90403047976, 19219.615607688047, 19234.519137021685, 19243.422697319103, 19249.711254331196, 8105.189481051965, 8120.918790812135, 8161.102278749333, 8175.386845986456, 8337.791555211046, 4664.883377915511, 4672.135654903854, 4673.0, 4728.219843725816, 4763.809447622057, 3324.1357247115925, 3368.9663103369144, 3430.554027976397, 3534.91162720934, 3537.3809583322814, 592.7747455966705, 596.0820336681462, 656.6651007985866, 676.9559978601375, 694.2294053600499, 646.2697152217963, 647.2136354329513, 658.3811217455576, 695.0894328429773, 715.6028404235595, 8791.0, 9187.862182067274, 9406.811863762687, 9521.095495927875, 9906.356086854332, 655.3839390972471, 728.7959371376023, 731.6524650790832, 733.5232099135497, 754.0649594502777, 4184.309588917856, 4293.8711838644895, 4460.620847227957, 4483.663725220622, 4513.323001549794, 61158.0826287606, 61196.0, 62043.689781550805, 62109.06836397458, 62431.37568624256, 51368.229476557884, 52765.208521872206, 52882.471175287756, 53162.46837531652, 53485.465145348826, 48934.510654893, 49671.751641241564, 49745.75127124414, 51020.0, 51618.0, 8590.613422395882, 8652.653893844428, 8719.215270625675, 8820.955895220482, 8861.113888611088, 35933.820330898176, 36590.8170459146, 36666.0, 38396.6160338393, 38418.231635367694, 42823.57176428196, 43138.13723725445, 46193.53806461892, 47423.0, 47640.52359476499, 11147.72130696739, 11151.888481115086, 11569.305841649528, 11587.652370428901, 11589.884101158881, 12081.879181208076, 12327.815082773945, 12332.136750427384, 12353.38233088324, 12963.027772917258, 10669.57321707123, 11009.504572294105, 11765.11761617865, 11810.940945295219, 12960.481580737041, 11794.29234245948, 11809.350485723024, 12022.158448908493, 12054.0, 12332.876671233531, 11614.6515604532, 11635.53457861676, 12212.08409369283, 12243.387830608612, 12444.128910976146, 10177.949110254402, 10182.643607473703, 10211.744706382102, 10246.129079028067, 10402.063814256753, 10162.441065741159, 10164.33931794431, 10181.236407269336, 10216.591336346462, 10355.741106472398], "unit": "score", "name": "yui.html", "value": 6904.980091175405}], "name": "dromaeo_css", "value": 7275.5444108704705}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 109.0, 104.0, 109.0, 111.0, 111.0, 99.0, 109.0, 110.0, 108.0], "unit": "score", "name": "ai-astar", "value": 108.0}, {"lowerIsBetter": true, "replicates": [148.0, 126.0, 148.0, 158.0, 127.0, 154.0, 153.0, 140.0, 171.0, 127.0], "unit": "score", "name": "audio-beat-detection", "value": 145.2}, {"lowerIsBetter": true, "replicates": [161.0, 163.0, 161.0, 160.0, 161.0, 162.0, 159.0, 164.0, 159.0, 162.0], "unit": "score", "name": "audio-dft", "value": 161.2}, {"lowerIsBetter": true, "replicates": [75.0, 76.0, 75.0, 171.0, 76.0, 76.0, 76.0, 73.0, 156.0, 72.0], "unit": "score", "name": "audio-fft", "value": 92.6}, {"lowerIsBetter": true, "replicates": [94.0, 93.0, 151.0, 93.0, 94.0, 94.0, 147.0, 92.0, 93.0, 141.0], "unit": "score", "name": "audio-oscillator", "value": 109.2}, {"lowerIsBetter": true, "replicates": [116.0, 116.0, 116.0, 116.0, 117.0, 116.0, 116.0, 117.0, 116.0, 116.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.2}, {"lowerIsBetter": true, "replicates": [146.0, 145.0, 146.0, 145.0, 145.0, 145.0, 145.0, 145.0, 146.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 145.3}, {"lowerIsBetter": true, "replicates": [95.0, 96.0, 96.0, 96.0, 95.0, 96.0, 96.0, 95.0, 95.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.5}, {"lowerIsBetter": true, "replicates": [53.0, 54.0, 54.0, 54.0, 55.0, 54.0, 56.0, 62.0, 54.0, 52.0], "unit": "score", "name": "json-parse-financial", "value": 54.8}, {"lowerIsBetter": true, "replicates": [65.0, 64.0, 64.0, 66.0, 65.0, 66.0, 65.0, 65.0, 65.0, 65.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 65.0}, {"lowerIsBetter": true, "replicates": [75.0, 79.0, 78.0, 77.0, 76.0, 84.0, 76.0, 76.0, 78.0, 78.0], "unit": "score", "name": "stanford-crypto-aes", "value": 77.7}, {"lowerIsBetter": true, "replicates": [113.0, 109.0, 113.0, 116.0, 112.0, 110.0, 110.0, 113.0, 112.0, 109.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 111.7}, {"lowerIsBetter": true, "replicates": [152.0, 142.0, 141.0, 139.0, 140.0, 129.0, 147.0, 144.0, 140.0, 151.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 142.5}, {"lowerIsBetter": true, "replicates": [67.0, 68.0, 65.0, 64.0, 64.0, 65.0, 65.0, 66.0, 63.0, 64.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 65.1}], "name": "kraken", "value": 1490.0}]} 09:12:02 INFO - Return code: 0 09:12:02 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 09:12:02 INFO - # TBPL SUCCESS # 09:12:02 INFO - Running post-action listener: _resource_record_post_action 09:12:02 INFO - Running post-run listener: _resource_record_post_run 09:12:04 INFO - Total resource usage - Wall time: 1187s; CPU: 13.0%; Read bytes: 4096; Write bytes: 365150208; Read time: 8; Write time: 268732 09:12:04 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 113356800; Read time: 0; Write time: 101696 09:12:04 INFO - run-tests - Wall time: 1172s; CPU: 13.0%; Read bytes: 4096; Write bytes: 251789312; Read time: 8; Write time: 166236 09:12:04 INFO - Running post-run listener: _upload_blobber_files 09:12:04 INFO - Blob upload gear active. 09:12:04 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 09:12:04 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 09:12:04 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'] 09:12:04 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 09:12:04 INFO - (blobuploader) - INFO - Open directory for files ... 09:12:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 09:12:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:12:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:12:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 09:12:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:12:05 INFO - (blobuploader) - INFO - Done attempting. 09:12:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 09:12:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:12:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:12:06 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 09:12:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:12:06 INFO - (blobuploader) - INFO - Done attempting. 09:12:06 INFO - (blobuploader) - INFO - Iteration through files over. 09:12:06 INFO - Return code: 0 09:12:06 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 09:12:06 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 09:12:06 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c3291e905b889973b5c4f1159631430aa6757abf265a3a2ddd2c82631b7f7b257ffe531bf831b7d8cb8a81bf1f38577dcc6b7b87dd6232a13bbdc74cc02dcf19", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d086bb801b9f2dbde1a7ee94791baac81ef2e38aec5529b772fee4ee849c79e6682f36eeb29c5a1b49cce826934842ad684461a85856f319ccfd57270444de42"} 09:12:06 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 09:12:06 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 09:12:06 INFO - Contents: 09:12:06 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/c3291e905b889973b5c4f1159631430aa6757abf265a3a2ddd2c82631b7f7b257ffe531bf831b7d8cb8a81bf1f38577dcc6b7b87dd6232a13bbdc74cc02dcf19", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d086bb801b9f2dbde1a7ee94791baac81ef2e38aec5529b772fee4ee849c79e6682f36eeb29c5a1b49cce826934842ad684461a85856f319ccfd57270444de42"} 09:12:06 INFO - Running post-run listener: copy_logs_to_upload_dir 09:12:06 INFO - Copying logs to upload dir... 09:12:06 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 09:12:06 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.641342 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-04-01 09:12:06.516056) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:06.519682) ========= 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-1459525609.104793-38389421 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/c3291e905b889973b5c4f1159631430aa6757abf265a3a2ddd2c82631b7f7b257ffe531bf831b7d8cb8a81bf1f38577dcc6b7b87dd6232a13bbdc74cc02dcf19", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d086bb801b9f2dbde1a7ee94791baac81ef2e38aec5529b772fee4ee849c79e6682f36eeb29c5a1b49cce826934842ad684461a85856f319ccfd57270444de42"} build_url:https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011196 build_url: 'https://queue.taskcluster.net/v1/task/fxz_49RGSNChekfvntEIZQ/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/c3291e905b889973b5c4f1159631430aa6757abf265a3a2ddd2c82631b7f7b257ffe531bf831b7d8cb8a81bf1f38577dcc6b7b87dd6232a13bbdc74cc02dcf19", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d086bb801b9f2dbde1a7ee94791baac81ef2e38aec5529b772fee4ee849c79e6682f36eeb29c5a1b49cce826934842ad684461a85856f319ccfd57270444de42"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:06.543791) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:06.544082) ========= 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-1459525609.104793-38389421 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004467 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-01 09:12:06.629927) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-01 09:12:06.630249) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-01 09:12:06.630533) ========= ========= Total master_lag: 0.52 =========