builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-022 starttime: 1456757968.1 results: success (0) buildid: 20160229043018 builduid: a016f65ab75a4546aa69586598a0e51e revision: 9da51cb4974e03cdd8fa45a34086fe1033abfeaf ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.105026) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.106072) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.106752) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.009139 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.135776) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.136486) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.151100) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.151803) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004588 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.205782) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.206428) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.207779) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.208492) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-29 06:59:28-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 215M=0s 2016-02-29 06:59:29 (215 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.588359 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.811178) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.811541) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.039678 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.864295) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:28.865079) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 9da51cb4974e03cdd8fa45a34086fe1033abfeaf --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 9da51cb4974e03cdd8fa45a34086fe1033abfeaf --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=9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-29 06:59:29,530 truncating revision to first 12 chars 2016-02-29 06:59:29,530 Setting DEBUG logging. 2016-02-29 06:59:29,530 attempt 1/10 2016-02-29 06:59:29,530 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/9da51cb4974e?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-29 06:59:29,804 unpacking tar archive at: mozilla-central-9da51cb4974e/testing/mozharness/ program finished with exit code 0 elapsedTime=0.636702 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:29.519294) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:29.520160) ========= echo 9da51cb4974e03cdd8fa45a34086fe1033abfeaf in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'9da51cb4974e03cdd8fa45a34086fe1033abfeaf'] 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=9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 9da51cb4974e03cdd8fa45a34086fe1033abfeaf program finished with exit code 0 elapsedTime=0.004671 script_repo_revision: '9da51cb4974e03cdd8fa45a34086fe1033abfeaf' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:29.577100) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:29.577825) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-29 06:59:29.588748) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-02-29 06:59:29.589452) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:59:30 INFO - MultiFileLogger online at 20160229 06:59:30 in /builds/slave/test-pgo 06:59:30 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 06:59:30 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 06:59:30 INFO - {'append_to_log': False, 06:59:30 INFO - 'base_work_dir': '/builds/slave/test-pgo', 06:59:30 INFO - 'blob_upload_branch': 'Firefox', 06:59:30 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 06:59:30 INFO - 'branch': 'Firefox', 06:59:30 INFO - 'buildbot_json_path': 'buildprops.json', 06:59:30 INFO - 'config_files': ('talos/linux_config.py',), 06:59:30 INFO - 'default_actions': ('clobber', 06:59:30 INFO - 'read-buildbot-config', 06:59:30 INFO - 'download-and-extract', 06:59:30 INFO - 'populate-webroot', 06:59:30 INFO - 'create-virtualenv', 06:59:30 INFO - 'install', 06:59:30 INFO - 'run-tests'), 06:59:30 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:59:30 INFO - 'download_minidump_stackwalk': True, 06:59:30 INFO - 'download_symbols': 'ondemand', 06:59:30 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:59:30 INFO - 'tooltool.py': '/tools/tooltool.py', 06:59:30 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:59:30 INFO - '/tools/misc-python/virtualenv.py')}, 06:59:30 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:59:30 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:59:30 INFO - 'installer_path': 'installer.exe', 06:59:30 INFO - 'log_level': 'info', 06:59:30 INFO - 'log_name': 'talos', 06:59:30 INFO - 'log_to_console': True, 06:59:30 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:59:30 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:59:30 INFO - 'opt_config_files': (), 06:59:30 INFO - 'pip_index': False, 06:59:30 INFO - 'sps_profile': False, 06:59:30 INFO - 'sps_profile_interval': 0, 06:59:30 INFO - 'suite': 'dromaeojs-e10s', 06:59:30 INFO - 'system_bits': '32', 06:59:30 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:59:30 INFO - 'title': 'talos-linux64-ix-022', 06:59:30 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:59:30 INFO - 'use_talos_json': True, 06:59:30 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 06:59:30 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:59:30 INFO - 'work_dir': 'build'} 06:59:30 INFO - ##### 06:59:30 INFO - ##### Running clobber step. 06:59:30 INFO - ##### 06:59:30 INFO - Running pre-action listener: _resource_record_pre_action 06:59:30 INFO - Running main action method: clobber 06:59:30 INFO - rmtree: /builds/slave/test-pgo/build 06:59:30 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 06:59:35 INFO - Running post-action listener: _resource_record_post_action 06:59:35 INFO - ##### 06:59:35 INFO - ##### Running read-buildbot-config step. 06:59:35 INFO - ##### 06:59:35 INFO - Running pre-action listener: _resource_record_pre_action 06:59:35 INFO - Running main action method: read_buildbot_config 06:59:35 INFO - Using buildbot properties: 06:59:35 INFO - { 06:59:35 INFO - "project": "", 06:59:35 INFO - "product": "firefox", 06:59:35 INFO - "script_repo_revision": "production", 06:59:35 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 06:59:35 INFO - "repository": "", 06:59:35 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 06:59:35 INFO - "buildid": "20160229043018", 06:59:35 INFO - "pgo_build": "True", 06:59:35 INFO - "basedir": "/builds/slave/test-pgo", 06:59:35 INFO - "buildnumber": 127, 06:59:35 INFO - "slavename": "talos-linux64-ix-022", 06:59:35 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 06:59:35 INFO - "platform": "ubuntu64_hw", 06:59:35 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 06:59:35 INFO - "branch": "mozilla-central", 06:59:35 INFO - "repo_path": "mozilla-central", 06:59:35 INFO - "revision": "9da51cb4974e03cdd8fa45a34086fe1033abfeaf", 06:59:35 INFO - "stage_platform": "linux64-pgo", 06:59:35 INFO - "builduid": "a016f65ab75a4546aa69586598a0e51e", 06:59:35 INFO - "slavebuilddir": "test" 06:59:35 INFO - } 06:59:35 INFO - Found installer url https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2. 06:59:35 INFO - Running post-action listener: _resource_record_post_action 06:59:35 INFO - ##### 06:59:35 INFO - ##### Running download-and-extract step. 06:59:35 INFO - ##### 06:59:35 INFO - Running pre-action listener: _resource_record_pre_action 06:59:35 INFO - Running main action method: download_and_extract 06:59:35 INFO - mkdir: /builds/slave/test-pgo/build/tests 06:59:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:59:35 INFO - https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 06:59:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/test_packages.json 06:59:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/test_packages.json 06:59:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 06:59:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 06:59:36 INFO - Downloaded 1448 bytes. 06:59:36 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 06:59:36 INFO - Using the following test package requirements: 06:59:36 INFO - {u'common': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 06:59:36 INFO - u'cppunittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 06:59:36 INFO - u'firefox-47.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 06:59:36 INFO - u'gtest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 06:59:36 INFO - u'firefox-47.0a1.en-US.linux-x86_64.gtest.tests.zip'], 06:59:36 INFO - u'jittest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 06:59:36 INFO - u'jsshell-linux-x86_64.zip'], 06:59:36 INFO - u'mochitest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 06:59:36 INFO - u'firefox-47.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 06:59:36 INFO - u'mozbase': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 06:59:36 INFO - u'reftest': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 06:59:36 INFO - u'firefox-47.0a1.en-US.linux-x86_64.reftest.tests.zip'], 06:59:36 INFO - u'talos': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 06:59:36 INFO - u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'], 06:59:36 INFO - u'web-platform': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 06:59:36 INFO - u'firefox-47.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 06:59:36 INFO - u'webapprt': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'], 06:59:36 INFO - u'xpcshell': [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 06:59:36 INFO - u'firefox-47.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 06:59:36 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 06:59:36 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')]} 06:59:36 INFO - https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:59:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 06:59:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 06:59:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 06:59:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:59:39 INFO - Downloaded 23372199 bytes. 06:59:39 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 06:59:39 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 06:59:40 INFO - Return code: 0 06:59:40 INFO - Downloading packages: [u'firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 06:59:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:59:40 INFO - https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:59:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 06:59:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 06:59:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip 06:59:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:59:41 INFO - Downloaded 23372199 bytes. 06:59:41 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 06:59:41 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 06:59:43 INFO - Return code: 0 06:59:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:59:43 INFO - https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 06:59:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 06:59:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 06:59:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip 06:59:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 06:59:44 INFO - Downloaded 10713410 bytes. 06:59:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 06:59:44 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 06:59:44 INFO - Return code: 0 06:59: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')]} 06:59:44 INFO - https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 06:59:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 06:59:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 06:59:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 06:59:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 06:59:48 INFO - Downloaded 56638391 bytes. 06:59:48 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 06:59:48 INFO - mkdir: /builds/slave/test-pgo/properties 06:59:48 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 06:59:48 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 06:59:48 INFO - Contents: 06:59:48 INFO - build_url:https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 06:59:48 INFO - Running post-action listener: _resource_record_post_action 06:59:48 INFO - Running post-action listener: set_extra_try_arguments 06:59:48 INFO - ##### 06:59:48 INFO - ##### Running populate-webroot step. 06:59:48 INFO - ##### 06:59:48 INFO - Running pre-action listener: _resource_record_pre_action 06:59:48 INFO - Running main action method: populate_webroot 06:59:48 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:59:48 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:59:48 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:59:48 INFO - '--tppagecycles', 06:59:48 INFO - '7'], 06:59:48 INFO - 'tests': ['tsvgm']}}, 06:59:48 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 06:59:48 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 06:59:48 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:59:48 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 06:59:48 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 06:59:48 INFO - 'tests': ['dromaeo_css', 'kraken']}, 06:59:48 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:59:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:59:48 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:59:48 INFO - 'talos_options': ['--e10s'], 06:59:48 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:59:48 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:59:48 INFO - 'tests': ['damp', 'tps']}, 06:59:48 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:59:48 INFO - 'talos_options': ['--e10s'], 06:59:48 INFO - 'tests': ['damp', 'tps']}, 06:59:48 INFO - 'g3': {'tests': ['dromaeo_dom']}, 06:59:48 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:59:48 INFO - 'other': {'tests': ['a11yr', 06:59:48 INFO - 'ts_paint', 06:59:48 INFO - 'tpaint', 06:59:48 INFO - 'sessionrestore', 06:59:48 INFO - 'sessionrestore_no_auto_restore']}, 06:59:48 INFO - 'other-e10s': {'talos_options': ['--e10s'], 06:59:48 INFO - 'tests': ['a11yr', 06:59:48 INFO - 'ts_paint', 06:59:48 INFO - 'tpaint', 06:59:48 INFO - 'sessionrestore', 06:59:48 INFO - 'sessionrestore_no_auto_restore']}, 06:59:48 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 06:59:48 INFO - 'tests': ['a11yr', 06:59:48 INFO - 'ts_paint', 06:59:48 INFO - 'tpaint', 06:59:48 INFO - 'sessionrestore', 06:59:48 INFO - 'sessionrestore_no_auto_restore']}, 06:59:48 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 06:59:48 INFO - 'tests': ['a11yr', 06:59:48 INFO - 'ts_paint', 06:59:48 INFO - 'tpaint', 06:59:48 INFO - 'sessionrestore', 06:59:48 INFO - 'sessionrestore_no_auto_restore']}, 06:59:48 INFO - 'other_l64': {'tests': ['a11yr', 06:59:48 INFO - 'ts_paint', 06:59:48 INFO - 'tpaint', 06:59:48 INFO - 'sessionrestore', 06:59:48 INFO - 'sessionrestore_no_auto_restore']}, 06:59:48 INFO - 'other_nol64': {'tests': ['a11yr', 06:59:48 INFO - 'ts_paint', 06:59:48 INFO - 'tpaint', 06:59:48 INFO - 'sessionrestore', 06:59:48 INFO - 'sessionrestore_no_auto_restore']}, 06:59:48 INFO - 'svgr': {'tests': ['tsvgx', 06:59:48 INFO - 'tsvgr_opacity', 06:59:48 INFO - 'tart', 06:59:48 INFO - 'tscrollx', 06:59:48 INFO - 'cart']}, 06:59:48 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 06:59:48 INFO - 'tests': ['tsvgx', 06:59:48 INFO - 'tsvgr_opacity', 06:59:48 INFO - 'tart', 06:59:48 INFO - 'tscrollx', 06:59:48 INFO - 'cart']}, 06:59:48 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:59:48 INFO - 'tests': ['tp5o']}, 06:59:48 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:59:48 INFO - 'talos_options': ['--e10s'], 06:59:48 INFO - 'tests': ['tp5o']}, 06:59:48 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:59:48 INFO - 'talos_options': ['--xperf_path', 06:59:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:59:48 INFO - 'tests': ['tp5n']}, 06:59:48 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:59:48 INFO - 'talos_options': ['--e10s', 06:59:48 INFO - '--xperf_path', 06:59:48 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:59:48 INFO - 'tests': ['tp5n']}}, 06:59:48 INFO - 'talos.zip': {'path': '', 06:59:48 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:59:48 INFO - Running post-action listener: _resource_record_post_action 06:59:48 INFO - ##### 06:59:48 INFO - ##### Running create-virtualenv step. 06:59:48 INFO - ##### 06:59:48 INFO - Running pre-action listener: _resource_record_pre_action 06:59:48 INFO - Running main action method: create_virtualenv 06:59:48 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 06:59: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 06:59:48 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 06:59:48 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:59:48 INFO - Using real prefix '/usr' 06:59:48 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 06:59:49 INFO - Installing distribute.............................................................................................................................................................................................done. 06:59:51 INFO - Installing pip.................done. 06:59:51 INFO - Return code: 0 06:59:51 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 06:59: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')]} 06:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:59:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59: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')]} 06:59:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:59:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59: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', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f5f69f54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcf9670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', '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 06:59: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', 'pip>=1.5'] in /builds/slave/test-pgo/build 06:59: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 pip>=1.5 06:59:51 INFO - Using env: {'DISPLAY': ':0', 06:59:51 INFO - 'HOME': '/home/cltbld', 06:59:51 INFO - 'LANG': 'en_US.UTF-8', 06:59:51 INFO - 'LANGUAGE': 'en_US:en', 06:59:51 INFO - 'LOGNAME': 'cltbld', 06:59:51 INFO - 'MAIL': '/var/mail/cltbld', 06:59:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:59:51 INFO - 'MOZ_NO_REMOTE': '1', 06:59:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:59:51 INFO - 'NO_EM_RESTART': '1', 06:59:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:59:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:59:51 INFO - 'PWD': '/builds/slave/test-pgo', 06:59:51 INFO - 'SHELL': '/bin/bash', 06:59:51 INFO - 'SHLVL': '1', 06:59:51 INFO - 'TERM': 'linux', 06:59:51 INFO - 'TMOUT': '86400', 06:59:51 INFO - 'USER': 'cltbld', 06:59:51 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 06:59:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:59:51 INFO - '_': '/tools/buildbot/bin/python'} 06:59:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:59: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 06:59:51 INFO - Cleaning up... 06:59:51 INFO - Return code: 0 06:59:51 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 06:59: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')]} 06:59:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:59:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59: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')]} 06:59:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:59:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59: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 0x7f5f69f54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcf9670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', '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 06:59: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 06:59: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 06:59:51 INFO - Using env: {'DISPLAY': ':0', 06:59:51 INFO - 'HOME': '/home/cltbld', 06:59:51 INFO - 'LANG': 'en_US.UTF-8', 06:59:51 INFO - 'LANGUAGE': 'en_US:en', 06:59:51 INFO - 'LOGNAME': 'cltbld', 06:59:51 INFO - 'MAIL': '/var/mail/cltbld', 06:59:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:59:51 INFO - 'MOZ_NO_REMOTE': '1', 06:59:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:59:51 INFO - 'NO_EM_RESTART': '1', 06:59:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:59:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:59:51 INFO - 'PWD': '/builds/slave/test-pgo', 06:59:51 INFO - 'SHELL': '/bin/bash', 06:59:51 INFO - 'SHLVL': '1', 06:59:51 INFO - 'TERM': 'linux', 06:59:51 INFO - 'TMOUT': '86400', 06:59:51 INFO - 'USER': 'cltbld', 06:59:51 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 06:59:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:59:51 INFO - '_': '/tools/buildbot/bin/python'} 06:59:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:59:51 INFO - Downloading/unpacking psutil>=0.7.1 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 06:59:53 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:59:53 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:59:53 INFO - Installing collected packages: psutil 06:59:53 INFO - Running setup.py install for psutil 06:59:53 INFO - building 'psutil._psutil_linux' extension 06:59: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 06:59: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 06:59:53 INFO - building 'psutil._psutil_posix' extension 06:59: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 06:59:54 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 06:59:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:59:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:59:54 INFO - Successfully installed psutil 06:59:54 INFO - Cleaning up... 06:59:54 INFO - Return code: 0 06:59:54 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 06:59:54 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')]} 06:59:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:59:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59:54 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')]} 06:59:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:59:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59:54 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 0x7f5f69f54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcf9670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', '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 06:59:54 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 06:59:54 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 06:59:54 INFO - Using env: {'DISPLAY': ':0', 06:59:54 INFO - 'HOME': '/home/cltbld', 06:59:54 INFO - 'LANG': 'en_US.UTF-8', 06:59:54 INFO - 'LANGUAGE': 'en_US:en', 06:59:54 INFO - 'LOGNAME': 'cltbld', 06:59:54 INFO - 'MAIL': '/var/mail/cltbld', 06:59:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:59:54 INFO - 'MOZ_NO_REMOTE': '1', 06:59:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:59:54 INFO - 'NO_EM_RESTART': '1', 06:59:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:59:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:59:54 INFO - 'PWD': '/builds/slave/test-pgo', 06:59:54 INFO - 'SHELL': '/bin/bash', 06:59:54 INFO - 'SHLVL': '1', 06:59:54 INFO - 'TERM': 'linux', 06:59:54 INFO - 'TMOUT': '86400', 06:59:54 INFO - 'USER': 'cltbld', 06:59:54 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 06:59:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:59:54 INFO - '_': '/tools/buildbot/bin/python'} 06:59:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:59:54 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59:56 INFO - Downloading mozsystemmonitor-0.0.tar.gz 06:59:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:59: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) 06:59:56 INFO - Installing collected packages: mozsystemmonitor 06:59:56 INFO - Running setup.py install for mozsystemmonitor 06:59:56 INFO - Successfully installed mozsystemmonitor 06:59:56 INFO - Cleaning up... 06:59:56 INFO - Return code: 0 06:59:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 06:59: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')]} 06:59:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:59:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59: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')]} 06:59:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:59:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59: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 0x7f5f69f54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcf9670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', '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 06:59: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 06:59: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 06:59:56 INFO - Using env: {'DISPLAY': ':0', 06:59:56 INFO - 'HOME': '/home/cltbld', 06:59:56 INFO - 'LANG': 'en_US.UTF-8', 06:59:56 INFO - 'LANGUAGE': 'en_US:en', 06:59:56 INFO - 'LOGNAME': 'cltbld', 06:59:56 INFO - 'MAIL': '/var/mail/cltbld', 06:59:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:59:56 INFO - 'MOZ_NO_REMOTE': '1', 06:59:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:59:56 INFO - 'NO_EM_RESTART': '1', 06:59:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:59:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:59:56 INFO - 'PWD': '/builds/slave/test-pgo', 06:59:56 INFO - 'SHELL': '/bin/bash', 06:59:56 INFO - 'SHLVL': '1', 06:59:56 INFO - 'TERM': 'linux', 06:59:56 INFO - 'TMOUT': '86400', 06:59:56 INFO - 'USER': 'cltbld', 06:59:56 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 06:59:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:59:56 INFO - '_': '/tools/buildbot/bin/python'} 06:59:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:59:56 INFO - Downloading/unpacking blobuploader==1.2.4 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59:58 INFO - Downloading blobuploader-1.2.4.tar.gz 06:59:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:59:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 06:59:58 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59: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 06:59:59 INFO - Downloading docopt-0.6.1.tar.gz 06:59:59 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 06:59:59 INFO - Installing collected packages: blobuploader, requests, docopt 06:59:59 INFO - Running setup.py install for blobuploader 06:59:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:59:59 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 06:59:59 INFO - Running setup.py install for requests 06:59:59 INFO - Running setup.py install for docopt 06:59:59 INFO - Successfully installed blobuploader requests docopt 06:59:59 INFO - Cleaning up... 06:59:59 INFO - Return code: 0 06:59:59 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 06:59:59 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')]} 06:59:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:59:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59:59 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')]} 06:59:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:59:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:59:59 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 0x7f5f69f54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcf9670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', '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 06:59:59 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 06:59:59 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 06:59:59 INFO - Using env: {'DISPLAY': ':0', 06:59:59 INFO - 'HOME': '/home/cltbld', 06:59:59 INFO - 'LANG': 'en_US.UTF-8', 06:59:59 INFO - 'LANGUAGE': 'en_US:en', 06:59:59 INFO - 'LOGNAME': 'cltbld', 06:59:59 INFO - 'MAIL': '/var/mail/cltbld', 06:59:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:59:59 INFO - 'MOZ_NO_REMOTE': '1', 06:59:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:59:59 INFO - 'NO_EM_RESTART': '1', 06:59:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:59:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 06:59:59 INFO - 'PWD': '/builds/slave/test-pgo', 06:59:59 INFO - 'SHELL': '/bin/bash', 06:59:59 INFO - 'SHLVL': '1', 06:59:59 INFO - 'TERM': 'linux', 06:59:59 INFO - 'TMOUT': '86400', 06:59:59 INFO - 'USER': 'cltbld', 06:59:59 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 06:59:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:59:59 INFO - '_': '/tools/buildbot/bin/python'} 06:59:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:59:59 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:00:00 INFO - Running setup.py (path:/tmp/pip-j0oVSd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:00:00 INFO - Running setup.py (path:/tmp/pip-TtyBk8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:00:00 INFO - Running setup.py (path:/tmp/pip-eUGdkW-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:00:00 INFO - Running setup.py (path:/tmp/pip-wuQP8F-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:00:00 INFO - Running setup.py (path:/tmp/pip-7RHfOd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:00:00 INFO - Running setup.py (path:/tmp/pip-xMdwZ9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:00:00 INFO - Running setup.py (path:/tmp/pip-k54Uvn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:00:00 INFO - Running setup.py (path:/tmp/pip-Lkeb4n-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:00:00 INFO - Running setup.py (path:/tmp/pip-eIkiF9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:00:00 INFO - Running setup.py (path:/tmp/pip-l3_hip-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:00:00 INFO - Running setup.py (path:/tmp/pip-IyilgF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:00:00 INFO - Running setup.py (path:/tmp/pip-DsMOUO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:00:00 INFO - Running setup.py (path:/tmp/pip-_R5aAc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:00:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:00:00 INFO - Running setup.py (path:/tmp/pip-Xhsl0S-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:00:01 INFO - Running setup.py (path:/tmp/pip-3YXoYi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:00:01 INFO - Running setup.py (path:/tmp/pip-14dozm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:00:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:00:01 INFO - Running setup.py (path:/tmp/pip-l5ZtxJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:00:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:00:01 INFO - Running setup.py install for manifestparser 07:00:01 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 07:00:01 INFO - Running setup.py install for mozcrash 07:00:01 INFO - Running setup.py install for mozdebug 07:00:01 INFO - Running setup.py install for mozdevice 07:00:01 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 07:00:01 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 07:00:01 INFO - Running setup.py install for mozfile 07:00:01 INFO - Running setup.py install for mozhttpd 07:00:01 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 07:00:01 INFO - Running setup.py install for mozinfo 07:00:01 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 07:00:01 INFO - Running setup.py install for mozInstall 07:00:02 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Running setup.py install for mozleak 07:00:02 INFO - Running setup.py install for mozlog 07:00:02 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Running setup.py install for moznetwork 07:00:02 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Running setup.py install for mozprocess 07:00:02 INFO - Running setup.py install for mozprofile 07:00:02 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Running setup.py install for mozrunner 07:00:02 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 07:00:02 INFO - Running setup.py install for mozscreenshot 07:00:02 INFO - Running setup.py install for moztest 07:00:02 INFO - Running setup.py install for mozversion 07:00:02 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 07:00:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:00:03 INFO - Cleaning up... 07:00:03 INFO - Return code: 0 07:00:03 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:00: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')]} 07:00:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:00:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:00: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')]} 07:00:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:00:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:00: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 0x7f5f69f54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcf9670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', '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 07:00: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 07:00: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 07:00:03 INFO - Using env: {'DISPLAY': ':0', 07:00:03 INFO - 'HOME': '/home/cltbld', 07:00:03 INFO - 'LANG': 'en_US.UTF-8', 07:00:03 INFO - 'LANGUAGE': 'en_US:en', 07:00:03 INFO - 'LOGNAME': 'cltbld', 07:00:03 INFO - 'MAIL': '/var/mail/cltbld', 07:00:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:00:03 INFO - 'MOZ_NO_REMOTE': '1', 07:00:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:00:03 INFO - 'NO_EM_RESTART': '1', 07:00:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:00:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:00:03 INFO - 'PWD': '/builds/slave/test-pgo', 07:00:03 INFO - 'SHELL': '/bin/bash', 07:00:03 INFO - 'SHLVL': '1', 07:00:03 INFO - 'TERM': 'linux', 07:00:03 INFO - 'TMOUT': '86400', 07:00:03 INFO - 'USER': 'cltbld', 07:00:03 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 07:00:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:00:03 INFO - '_': '/tools/buildbot/bin/python'} 07:00:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:00:03 INFO - Running setup.py (path:/tmp/pip-jYIJzi-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 07:00: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)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:00:03 INFO - Running setup.py (path:/tmp/pip-o7OQP1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 07:00:03 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:00:03 INFO - Running setup.py (path:/tmp/pip-uvs4Ng-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 07:00: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)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:00:03 INFO - Running setup.py (path:/tmp/pip-5EFRwF-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 07:00: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)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 07:00:03 INFO - Running setup.py (path:/tmp/pip-7fekAe-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 07:00:03 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)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:00:03 INFO - Running setup.py (path:/tmp/pip-NhGWsf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 07:00:03 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)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:00:03 INFO - Running setup.py (path:/tmp/pip-vaqAXQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 07:00:03 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)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:00:03 INFO - Running setup.py (path:/tmp/pip-C1HEZa-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 07:00:03 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)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 07:00:03 INFO - Running setup.py (path:/tmp/pip-z0NH7F-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 07:00:03 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)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 07:00:03 INFO - Running setup.py (path:/tmp/pip-iofQPu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 07:00:03 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)) 07:00:03 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:00:03 INFO - Running setup.py (path:/tmp/pip-mpNh0G-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 07:00: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)) 07:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:00:04 INFO - Running setup.py (path:/tmp/pip-Qk_oLf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 07:00: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)) 07:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:00:04 INFO - Running setup.py (path:/tmp/pip-EuVIzP-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 07:00: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)) 07:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:00:04 INFO - Running setup.py (path:/tmp/pip-O6IHgJ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 07:00: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)) 07:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:00:04 INFO - Running setup.py (path:/tmp/pip-JZNblY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 07:00: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)) 07:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 07:00:04 INFO - Running setup.py (path:/tmp/pip-WlcY8K-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 07:00: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)) 07:00:04 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 07:00:04 INFO - Running setup.py (path:/tmp/pip-WznFSQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 07:00: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)) 07:00: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.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:00: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.16->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 2)) 07:00: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)) 07:00: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)) 07:00: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)) 07:00:04 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 07:00: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 07:00: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 07:00: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 07:00: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 07:00: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 07:00: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 07:00:06 INFO - Downloading blessings-1.6.tar.gz 07:00:06 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 07:00:06 INFO - Installing collected packages: blessings 07:00:06 INFO - Running setup.py install for blessings 07:00:06 INFO - Successfully installed blessings 07:00:06 INFO - Cleaning up... 07:00:06 INFO - Return code: 0 07:00:06 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 07:00:06 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:00:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:00:06 INFO - Reading from file tmpfile_stdout 07:00:06 INFO - Current package versions: 07:00:06 INFO - argparse == 1.2.1 07:00:06 INFO - blessings == 1.6 07:00:06 INFO - blobuploader == 1.2.4 07:00:06 INFO - docopt == 0.6.1 07:00:06 INFO - manifestparser == 1.1 07:00:06 INFO - mozInstall == 1.12 07:00:06 INFO - mozcrash == 0.16 07:00:06 INFO - mozdebug == 0.1 07:00:06 INFO - mozdevice == 0.48 07:00:06 INFO - mozfile == 1.2 07:00:06 INFO - mozhttpd == 0.7 07:00:06 INFO - mozinfo == 0.9 07:00:06 INFO - mozleak == 0.1 07:00:06 INFO - mozlog == 3.1 07:00:06 INFO - moznetwork == 0.27 07:00:06 INFO - mozprocess == 0.22 07:00:06 INFO - mozprofile == 0.28 07:00:06 INFO - mozrunner == 6.11 07:00:06 INFO - mozscreenshot == 0.1 07:00:06 INFO - mozsystemmonitor == 0.0 07:00:06 INFO - moztest == 0.7 07:00:06 INFO - mozversion == 1.4 07:00:06 INFO - psutil == 3.1.1 07:00:06 INFO - requests == 1.2.3 07:00:06 INFO - wsgiref == 0.1.2 07:00:06 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 07:00:06 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')]} 07:00:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:00:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:00:06 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')]} 07:00:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:00:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:00:06 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 0x7f5f69f54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcf9670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', '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 07:00:06 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 07:00:06 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 07:00:06 INFO - Using env: {'DISPLAY': ':0', 07:00:06 INFO - 'HOME': '/home/cltbld', 07:00:06 INFO - 'LANG': 'en_US.UTF-8', 07:00:06 INFO - 'LANGUAGE': 'en_US:en', 07:00:06 INFO - 'LOGNAME': 'cltbld', 07:00:06 INFO - 'MAIL': '/var/mail/cltbld', 07:00:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:00:06 INFO - 'MOZ_NO_REMOTE': '1', 07:00:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:00:06 INFO - 'NO_EM_RESTART': '1', 07:00:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:00:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:00:06 INFO - 'PWD': '/builds/slave/test-pgo', 07:00:06 INFO - 'SHELL': '/bin/bash', 07:00:06 INFO - 'SHLVL': '1', 07:00:06 INFO - 'TERM': 'linux', 07:00:06 INFO - 'TMOUT': '86400', 07:00:06 INFO - 'USER': 'cltbld', 07:00:06 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 07:00:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:00:06 INFO - '_': '/tools/buildbot/bin/python'} 07:00:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:00:06 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)) 07:00:06 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)) 07:00:06 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)) 07:00:06 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)) 07:00:06 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)) 07:00:06 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)) 07:00:06 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)) 07:00:06 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)) 07:00:06 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)) 07:00:06 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)) 07:00:06 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)) 07:00:06 INFO - Cleaning up... 07:00:06 INFO - Return code: 0 07:00:06 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 07:00:06 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')]} 07:00:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:00:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:00:06 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')]} 07:00:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:00:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:00:06 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 0x7f5f69f54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcf9670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', '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 07:00:06 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 07:00:06 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 07:00:06 INFO - Using env: {'DISPLAY': ':0', 07:00:06 INFO - 'HOME': '/home/cltbld', 07:00:06 INFO - 'LANG': 'en_US.UTF-8', 07:00:06 INFO - 'LANGUAGE': 'en_US:en', 07:00:06 INFO - 'LOGNAME': 'cltbld', 07:00:06 INFO - 'MAIL': '/var/mail/cltbld', 07:00:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:00:06 INFO - 'MOZ_NO_REMOTE': '1', 07:00:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:00:06 INFO - 'NO_EM_RESTART': '1', 07:00:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:00:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:00:06 INFO - 'PWD': '/builds/slave/test-pgo', 07:00:06 INFO - 'SHELL': '/bin/bash', 07:00:06 INFO - 'SHLVL': '1', 07:00:06 INFO - 'TERM': 'linux', 07:00:06 INFO - 'TMOUT': '86400', 07:00:06 INFO - 'USER': 'cltbld', 07:00:06 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 07:00:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:00:06 INFO - '_': '/tools/buildbot/bin/python'} 07:00:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:00:07 INFO - Downloading/unpacking jsonschema 07:00: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 07:00: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 07:00: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 07:00: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 07:00: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 07:00: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 07:00:09 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:00:09 INFO - Downloading/unpacking functools32 (from jsonschema) 07:00:09 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 07:00:09 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 07:00:09 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 07:00:09 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 07:00:09 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 07:00:09 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 07:00:09 INFO - Downloading functools32-3.2.3-2.tar.gz 07:00:09 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 07:00:09 INFO - warning: no files found matching '*.txt' 07:00:09 INFO - no previously-included directories found matching 'build' 07:00:09 INFO - no previously-included directories found matching 'dist' 07:00:09 INFO - no previously-included directories found matching '.git*' 07:00:09 INFO - Installing collected packages: jsonschema, functools32 07:00:09 INFO - Running setup.py install for functools32 07:00:09 INFO - warning: no files found matching '*.txt' 07:00:09 INFO - no previously-included directories found matching 'build' 07:00:09 INFO - no previously-included directories found matching 'dist' 07:00:09 INFO - no previously-included directories found matching '.git*' 07:00:09 INFO - Successfully installed jsonschema functools32 07:00:09 INFO - Cleaning up... 07:00:09 INFO - Return code: 0 07:00:09 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 07:00:09 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')]} 07:00:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:00:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:00:09 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')]} 07:00:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:00:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:00:09 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 0x7f5f69f54f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc2c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xcf9670>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', '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 07:00:09 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 07:00:09 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 07:00:09 INFO - Using env: {'DISPLAY': ':0', 07:00:09 INFO - 'HOME': '/home/cltbld', 07:00:09 INFO - 'LANG': 'en_US.UTF-8', 07:00:09 INFO - 'LANGUAGE': 'en_US:en', 07:00:09 INFO - 'LOGNAME': 'cltbld', 07:00:09 INFO - 'MAIL': '/var/mail/cltbld', 07:00:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:00:09 INFO - 'MOZ_NO_REMOTE': '1', 07:00:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:00:09 INFO - 'NO_EM_RESTART': '1', 07:00:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:00:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:00:09 INFO - 'PWD': '/builds/slave/test-pgo', 07:00:09 INFO - 'SHELL': '/bin/bash', 07:00:09 INFO - 'SHLVL': '1', 07:00:09 INFO - 'TERM': 'linux', 07:00:09 INFO - 'TMOUT': '86400', 07:00:09 INFO - 'USER': 'cltbld', 07:00:09 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 07:00:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:00:09 INFO - '_': '/tools/buildbot/bin/python'} 07:00:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:00:09 INFO - Downloading/unpacking flake8 07:00:09 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 07:00:09 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 07:00:09 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 07:00:09 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 07:00:09 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 07:00:09 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 07:00:11 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 07:00:11 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 07:00:11 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 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 07:00:11 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 07:00:12 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 07:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:00:12 INFO - no previously-included directories found matching 'docs/_build' 07:00:12 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 07:00:12 INFO - Running setup.py install for pep8 07:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 07:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 07:00:12 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 07:00:12 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 07:00:12 INFO - no previously-included directories found matching 'docs/_build' 07:00:12 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 07:00:12 INFO - Successfully installed flake8 mccabe pyflakes pep8 07:00:12 INFO - Cleaning up... 07:00:12 INFO - Return code: 0 07:00:12 INFO - Running post-action listener: _resource_record_post_action 07:00:12 INFO - Running post-action listener: _start_resource_monitoring 07:00:12 INFO - Starting resource monitoring. 07:00:12 INFO - ##### 07:00:12 INFO - ##### Running install step. 07:00:12 INFO - ##### 07:00:12 INFO - Running pre-action listener: _resource_record_pre_action 07:00:12 INFO - Running main action method: install 07:00:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 07:00:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 07:00:12 INFO - Reading from file tmpfile_stdout 07:00:12 INFO - Detecting whether we're running mozinstall >=1.0... 07:00:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 07:00:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 07:00:12 INFO - Reading from file tmpfile_stdout 07:00:12 INFO - Output received: 07:00:12 INFO - Usage: mozinstall [options] installer 07:00:12 INFO - Options: 07:00:12 INFO - -h, --help show this help message and exit 07:00:12 INFO - -d DEST, --destination=DEST 07:00:12 INFO - Directory to install application into. [default: 07:00:12 INFO - "/builds/slave/test-pgo"] 07:00:12 INFO - --app=APP Application being installed. [default: firefox] 07:00:12 INFO - mkdir: /builds/slave/test-pgo/build/application 07:00:12 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 07:00:12 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 07:00:29 INFO - Reading from file tmpfile_stdout 07:00:29 INFO - Output received: 07:00:29 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 07:00:29 INFO - Running post-action listener: _resource_record_post_action 07:00:29 INFO - ##### 07:00:29 INFO - ##### Running run-tests step. 07:00:29 INFO - ##### 07:00:29 INFO - Running pre-action listener: _resource_record_pre_action 07:00:29 INFO - Running main action method: run_tests 07:00:29 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 07:00:29 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 07:00:29 INFO - Python 2.7.3 07:00:29 INFO - Return code: 0 07:00:29 INFO - grabbing minidump binary from tooltool 07:00:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 07:00:29 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 0xd888c0>, '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 0xd897c0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd89c50>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 07:00:29 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 07:00:29 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 07:00:29 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:00:29 INFO - Return code: 0 07:00:29 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 07:00:29 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 07:00:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 07:00:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 07:00:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 07:00:29 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 07:00:29 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 07:00:30 INFO - Return code: 0 07:00:30 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-022', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test-pgo/build 07:00:30 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-022 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log 07:00:30 INFO - Using env: {'DISPLAY': ':0', 07:00:30 INFO - 'HOME': '/home/cltbld', 07:00:30 INFO - 'LANG': 'en_US.UTF-8', 07:00:30 INFO - 'LANGUAGE': 'en_US:en', 07:00:30 INFO - 'LOGNAME': 'cltbld', 07:00:30 INFO - 'MAIL': '/var/mail/cltbld', 07:00:30 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:00:30 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 07:00:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:00:30 INFO - 'MOZ_NO_REMOTE': '1', 07:00:30 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 07:00:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:00:30 INFO - 'NO_EM_RESTART': '1', 07:00:30 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:00:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 07:00:30 INFO - 'PWD': '/builds/slave/test-pgo', 07:00:30 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 07:00:30 INFO - 'SHELL': '/bin/bash', 07:00:30 INFO - 'SHLVL': '1', 07:00:30 INFO - 'TERM': 'linux', 07:00:30 INFO - 'TMOUT': '86400', 07:00:30 INFO - 'USER': 'cltbld', 07:00:30 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780', 07:00:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:00:30 INFO - '_': '/tools/buildbot/bin/python'} 07:00:30 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-022', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 07:00:30 INFO - mozversion application_buildid: 20160229043018 07:00:30 INFO - mozversion application_changeset: 9da51cb4974e03cdd8fa45a34086fe1033abfeaf 07:00:30 INFO - mozversion application_display_name: Nightly 07:00:30 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:00:30 INFO - mozversion application_name: Firefox 07:00:30 INFO - mozversion application_remotingname: firefox 07:00:30 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 07:00:30 INFO - mozversion application_vendor: Mozilla 07:00:30 INFO - mozversion application_version: 47.0a1 07:00:30 INFO - mozversion platform_buildid: 20160229043018 07:00:30 INFO - mozversion platform_changeset: 9da51cb4974e03cdd8fa45a34086fe1033abfeaf 07:00:30 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 07:00:30 INFO - mozversion platform_version: 47.0a1 07:00:30 INFO - using testdate: 1456758030 07:00:30 INFO - actual date: 1456758030 07:00:30 INFO - starting webserver on 'localhost:42846' 07:00:30 INFO - SUITE-START | Running 2 tests 07:00:30 INFO - TEST-START | dromaeo_css 07:00:30 INFO - operating with platform_type : linux_ 07:00:30 INFO - Initialising browser for dromaeo_css test... 07:00:30 INFO - TEST-INFO | started process 14601 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpDsZaLa/profile http://localhost:42846/getInfo.html) 07:00:34 INFO - PROCESS | 14601 | 07:00:34 INFO - PROCESS | 14601 | (process:14683): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:00:35 INFO - PROCESS | 14601 | __metrics Screen width/height:1600/1200 07:00:35 INFO - PROCESS | 14601 | colorDepth:24 07:00:35 INFO - PROCESS | 14601 | Browser inner width/height: 1024/697 07:00:35 INFO - PROCESS | 14601 | __metrics 07:00:35 ERROR - PROCESS | 14601 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 07:00:35 INFO - PROCESS | 14601 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:00:35 INFO - PROCESS | 14601 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:00:35 INFO - PROCESS | 14601 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:00:35 INFO - PROCESS | 14601 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:00:35 INFO - PROCESS | 14601 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:00:35 INFO - PROCESS | 14601 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:00:35 INFO - PROCESS | 14601 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:00:35 INFO - PROCESS | 14601 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:00:35 INFO - PROCESS | 14601 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:00:36 INFO - TEST-INFO | 14601: exit 0 07:00:36 INFO - Browser initialized. 07:00:36 INFO - Running cycle 1/1 for dromaeo_css test... 07:00:36 INFO - TEST-INFO | started process 14734 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpDsZaLa/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:00:38 INFO - PROCESS | 14734 | 07:00:38 INFO - PROCESS | 14734 | (process:14795): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:00:48 INFO - PROCESS | 14734 | RSS: Main: 160968704 07:00:48 INFO - PROCESS | 14734 | 07:01:38 INFO - PROCESS | 14734 | 1456758098200 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] 07:03:45 INFO - PROCESS | 14734 | Cycle 1(1): loaded http://localhost:42846/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42846/tests/dromaeo/cssquery-ext.html) 07:03:46 INFO - PROCESS | 14734 | RSS: Main: 169914368 07:03:46 INFO - PROCESS | 14734 | 07:06:48 INFO - PROCESS | 14734 | Cycle 1(1): loaded http://localhost:42846/tests/dromaeo/cssquery-ext.html (next: http://localhost:42846/tests/dromaeo/cssquery-jquery.html) 07:06:49 INFO - PROCESS | 14734 | RSS: Main: 164868096 07:06:49 INFO - PROCESS | 14734 | 07:09:50 INFO - PROCESS | 14734 | Cycle 1(1): loaded http://localhost:42846/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42846/tests/dromaeo/cssquery-mootools.html) 07:09:51 INFO - PROCESS | 14734 | RSS: Main: 166916096 07:09:51 INFO - PROCESS | 14734 | 07:12:53 INFO - PROCESS | 14734 | Cycle 1(1): loaded http://localhost:42846/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42846/tests/dromaeo/cssquery-prototype.html) 07:12:53 INFO - PROCESS | 14734 | RSS: Main: 163901440 07:12:53 INFO - PROCESS | 14734 | 07:15:56 INFO - PROCESS | 14734 | Cycle 1(1): loaded http://localhost:42846/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42846/tests/dromaeo/cssquery-yui.html) 07:15:56 INFO - PROCESS | 14734 | RSS: Main: 166125568 07:15:56 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | Cycle 1(1): loaded http://localhost:42846/tests/dromaeo/cssquery-yui.html (next: http://localhost:42846/tests/dromaeo/cssquery-dojo.html) 07:18:59 INFO - PROCESS | 14734 | RSS: Main: 168816640 07:18:59 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | __start_tp_report 07:18:59 INFO - PROCESS | 14734 | _x_x_mozilla_page_load 07:18:59 INFO - PROCESS | 14734 | _x_x_mozilla_page_load_details 07:18:59 INFO - PROCESS | 14734 | |i|pagename|runs| 07:18:59 INFO - PROCESS | 14734 | |0;dojo.html;3148.212946763309;3193.776435649504;3222.7099561039504;3227.8547465364063;3245.1075954112616;5027.371578552681;5117.897642047162;5123.948760512399;5162.767675454605;5192.1432963560965;5009.398872135349;5017.498250174981;5045.697258164512;5189.377274727038;5244.213367994793;98.75035480954779;4694.08465349257;4757.976210118962;4759.571638552529;4794.137055330039;4589.885252868671;4671.042436300567;4703.176944034797;4713.38725965624;4754.120487709767;4788.712677239359;4789.880252993686;4796.08874313881;4802.471728109905;4861.73260470674;4796;4810.711357318537;4817.638677099197;4823.445303790038;4856.150173719585;4644.6052085572765;4688.038952014829;4701.435827700664;4750.501197374295;4768.880777980544;5048.924266136011;5069.746512674352;5081;5129.25625784263;5133.332666753336;5359.598030147716;5610.074337734269;5628.774849006035;5631.465010823965;5638.830835074954;5529.170624406331;5548.4174161713245;5554.666719996772;5564.8330550083565;5629.211910332557;5126.53861152498;5195.402528709171;5196.714180720059;5197.428282888879;5247.265382846443;5518.558515318765;5644.85887852807;5647;5650.434956504317;5653.9151912721345;5349.866253343697;5375.6774593524515;5382.165764306539;5428.104362780097;5428.972855135699;5445.074337362658;5445.863853403617;5462.945370546323;5465.453454654582;5499.340079190442;5336.0661884170895;5393.6763794172475;5440.156775699773;5451.64564303319;5474.534664553557;5479.506844384025;5506.64206826555;5507.807226747044;5520.199571062173;5554.833354999357;4202.453681021448;4203.222403855297;4238.491381034234;4269.7224680395675;4282.76444795533;3760.9623903761158;3785.488958990501;3811.5807261201244;3892.0853599404118;3906.531216254011;5219.8434046978655;5307.708076055854;5357.732113394315;5364.168553874156;5378.97310513445;5597.860053498695;5636.210930469738;5646.830595082154;5647.943520564824;5652.236948011966;5072.9746351268;5258.605604579672;5300.416954135042;5311.973440132774;5342.9465705342445;4688.2733176357715;4697.154512187839;4698.201305777958;4698.483166851644;4701.059788042405;5785.971070144707;5803.738831752581;5816.738246778905;5819.185314056035;5833.270841144857;5364.812231571798;5372.865678358073;5464.453554644504;5501.587380946365;5530.419305972815;5754.4533269339345;5794.072948328248;5805.332386775406;5838.532917366516;5847.356790753099;5348.197770334481;5492.47821456961;5498.80754173602;5512.614117011931;5532.529734972572;5479.561635069105;5522.6134170607675;5531.225628411945;5566.22072909801;5582.720863956704;5348;5372.650777699437;5377.542908852635;5407.134858422633;5434.293541839694;5257.132573125545;5394.703291319015;5406.972675191701;5459.099248623933;5482.068048431696;5316.255724198538;5347.171188465794;5374.838754837361;5382.596305277041;5423.2407462954425;5375.247465354775;5397.78408863641;5412.269343638558;5445.128779395278;5487.039768040497;5128.307678463509;5280.023195708806;5311.150215965427;5379.220013098157;5379.892402152013 07:18:59 INFO - PROCESS | 14734 | |1;ext.html;494.4610374691588;521.4785214785214;521.629642953503;538.4991957479544;540.8242321245594;36187.99999999996;36618.63381366186;36718.26563468729;36835.631643683555;36975.26049479009;39410.40884386729;39717.60282397175;39811.60188398115;39909;39923.20153596926;8373.120822313645;8587.184217499358;8608.311335093178;8621.439606425562;8630.611622476972;8407.369447291447;8445.028821685524;8500.362472814533;8766.386352955264;8808.515531645757;8725.563721813916;8751.299896008304;8751.431156974808;8820.514871682055;8831.381803273742;8715.782105447352;8782.560871956408;8788.824223515527;8804.42771219875;8816.779580510474;8618.698345557876;8662.6101825418;8683.088275731021;8731.388802783744;8780.517071561062;39441.21117577661;39796.204075918606;40236.59763402358;40262.57111717709;40459.79770101131;2852.6006359109742;3201.5668092249825;3315.295296387597;4081.632653061209;4187.644050255732;26958.73041269582;27227.86386068057;27980;28423.715762842312;28432;3690.870819521304;3701.5188025556777;3743.1952130291847;3755.7746535207702;3777.244551089793;210412;211355;211831.99999999846;212341;212678;56550.586235344446;56749.716251419304;56817;57015;57097.14354284689;59792.70103649541;59902.40097599055;65738.67130664315;66215;67053;14374.784378234335;14595.92702036483;14632.487862924747;14642.121472711671;14647.780283295759;10709.785804284027;10771.78456430867;10772.569097236179;10780.622678206226;10836.891631083588;19732.70400943987;20492.795072049088;20681.379558613266;20752;20808.791912080684;7870.819377093368;8361.456505327134;8373.581320933929;8418.536980466133;8430.957845210858;1071.164491696478;1080.3409919948824;1084.0514549768952;1121.6410748560381;1137.9601713940137;28181.57727634087;28653.426931461672;28923.710762892522;28927;29151;1118.1502058435647;1119.9664010079712;1125.876153623101;1129.390129330169;1138.174823253135;14573.562793116223;14922.328495217742;15013.324400401789;15150.924245378703;15210.163441010629;298265;301822;302980;305404;306476;51432.22851657228;52203;52273.7386313066;52498.21252681137;52522;1301.9283939383424;1344.253939063829;1347.070521340272;1349.1770020287813;1352.668596193919;27335;28591.85704071466;28749;28853.42293154167;28887.42225155443;46084.30873536832;46189;46307;46324.30513542367;46628.7668561655;284329;284683;286303;286411;287021;31910.84044579762;31978.84010579932;32594;32830;32842.67157328492;42945;43540.78229608832;44122.558774411846;44168.779156104014;44405.77797111123;36361.27277454489;36979;37076.62923370732;37851;38077.61922380741;36383;36431.45352819763;36810.8159459201;36976.26047479089;37096.814515927246;36055.918322450365;36561.81719091388;38660.420093698056;38738.225235495695;38842;29722.85138574293;31068.22329441782;32468.188295292806;34141.61008729365;34391;24874.875625621757;25174.24477265685;25515.744842551336;25610.71946402635;25793.355166120247 07:18:59 INFO - PROCESS | 14734 | |2;jquery.html;350.269687701143;351.51315428132045;353.3568904593639;355.88789531297624;356.8412056634797;16251.51245462635;16774.91612541937;17225.91387043066;17712.114394280266;17741.64516709665;13300.46798128076;13692;16405.179741012962;16431.096289704063;16501.587460313498;5161.767720452589;5236.476352364762;5356;5448.346198456191;5468.6171967962255;3823.8279277432443;5365.704886231256;5565.471280228372;5590.245316882229;5616.803411880585;5591.664500129985;5605.775768969257;5624.887502249952;5633.845061762328;5633.887322253552;5443.618946673734;5627.6904770237625;5629.577781666371;5673;5684.516816070639;5385.138377859524;5444.183372494118;5456.399796022434;5461.890762184774;5523.917141242885;17461.476155715223;20835.58328833415;20976;21087;21100.05049772764;2175.369142948543;2206.856554323964;2339.8830058497006;2350.330155905576;2772.1942630841436;9509.476978766164;9558.569864356052;9593.568289426992;9754;9858.753531161707;1822.271091563372;1916.1473144450724;1934.7001214811726;1940.7088936659613;1957.3345062678616;59065;64565;66332;66923.66538167327;67817.66091169562;9936.900630993741;10069.244806639532;10232.693019209435;10287.639932602324;10404.27170098101;13281.535146269835;13425.798613020812;13440.65593440648;13538.86461135376;13573.660658483419;7325.450591205681;7389.408847292204;7420.591867447342;7483.550986940801;7505.099388073466;7106.538075025107;7205;7310.96344518274;7362.889556656654;7502.2122677119205;4510.909781804411;4575.611073058761;4578.679492435497;4640.721556706609;4661.137689527448;1840.8251216134445;1878.2017642501883;1926.4413320137003;1933.6712758831034;1946.2117842273901;939.9577019034023;959.1511512311655;962.5957098018849;986.2455221755363;1026.9383836969805;16472.752908706378;16480.0935948524;16913.91543042277;17011.744823827652;17085.829141708673;862.4480332587149;913.6939125392935;939.135994884694;959.1703176752059;986.6793292180071;8774.60514276859;8951.888071599113;8971.551422428853;9111.772205694779;9283.76790580241;408167;411222;412506;416662;416831;72749;76519.23480765121;76700;76805;79025.60487197642;1013.138831992815;1021.9437930913722;1028.8919663435381;1029.809485245232;1057.3021805608262;14281.714365712834;14295.857041429452;14377.856221437652;14580.489682861049;14624.561263162122;30185.698143019166;31203;31337.529937050505;31508.684913150573;33168.668313317525;39833.80083099682;40087.1982560353;40094.799526002185;40190.598094018686;40883.59116408917;7914.920850791418;8017.438779285394;8181.67273309061;8430.283425908867;8460.619272132646;8971.955140224518;12019.158658894143;12109.51561937548;12417.254964702146;12593;10060.496975151067;10157.39055656663;10272.691819245434;10388.220883433924;10850.728731781768;10748.408837514013;10788.676339709822;10792.190585706261;10891.564337426415;11047.834282485608;10441;10771.838422423827;10886.183536234972;10954.616588419367;11027.22809403334;8211.466254693425;8235.094139644754;8251.174882511701;8365.121662225622;8400.705975290835;9592.23262139041;10767.887000574045;10927.617533386612;10997.285176463503;11034.17243706709 07:18:59 INFO - PROCESS | 14734 | |3;mootools.html;1477.2539867366977;1482.266278192295;1644.5970737169396;1740.9825901740994;1777.662244173607;6695.799126026215;7448.478606497547;7510.324070833624;7682.231776822322;7751.108622508414;7525.698972041112;7543.962280188605;7708.30625243728;7722.806929826757;7732.806679833007;2093.947651308722;2094.958100837986;2100.180929437513;2112.8837913914726;2117.4071260047212;2103.5582527669208;2113.9048742806535;2190.3319487556287;2203.493196564783;2203.8457307988447;2080.1783295598307;2101.8108370246673;2112.207922029239;2112.524681946565;2167.035669127239;2145.3885642591863;2158.3740715192575;2159.265849611132;2161.4056134562966;2175.749788774295;2114.5242320477923;2166.1118941234017;2168.5012447137246;2171.9674204886937;2176.4776453651166;7581.962090189569;7604.315611594928;7614.238576142397;7639.618019099023;7641.3886889048745;4327.37253098299;4443.000324926866;4447.155040542287;4468.82124715011;4481.103779244132;2875.971240287591;2883.8125521841225;2963.970360296391;2975.4197931403387;3014.3368458939;903.2818908967387;921.1893533690377;944.2210176604328;946.7727745341138;947.4741518457254;10552.366857988545;10564.418956957365;10640.255182137253;10694.304870183412;10736.30214036093;3821.9617803821607;3913.0021844430057;3927.096767743435;3931.0761970936805;4012.9197416052098;8081.757547273592;8123.350131989427;8132.390070744717;8137.552434616035;8140.511569305861;4226.725262857904;4270.807813648394;4274.230638485103;4278.871633850989;4280.807363668642;3812.84748610058;3904.843806247775;3925.74482658632;3942.783146926889;3974.82113304902;3274.7052765250764;3324.1855745342546;3333.6999670029813;3378.2567835076243;3380.4084285249983;984.8325784616633;1001.2390583156707;1006.6577363696379;1008.621766837436;1026.2662196529518;1275.0946827752214;1276.393712986324;1285.0875878126635;1289.7936330187124;1330.255057167989;7161.498695091398;7297.744578939712;7329.267073292628;7337.816554586071;7343.742968996059;1035.8756949166147;1039.9740006499746;1044.6604853422668;1045.8274384726435;1075.231209685079;5780.104083867007;5822.155787410802;5856.1508581255475;5868.589198756046;5883.264591926009;9229.261659067259;9291.396059256127;9522.0954009369;9547;9595;9293.210077143383;9359.298052645943;9401.059894010545;9425.71722848302;9472.052794720474;7298.635068246673;7311.89032164518;7352.742654007084;7388.335049845432;7409.851802963911;7051.365377116084;7057.2237053925055;7125.857482850418;7143;7143.464240181903;8207.138250483613;8306.958465207636;8432.620532076195;8496;8574.31405487572;8668.956655216683;8740.91259087401;8748.300135988979;8760.956195218983;8785.209331160226;5669.121286200645;6200.7519699211525;6311.589746666452;6563.343665633399;6595.571287866273;7294.051773269441;7311.122665280201;7352.705891764484;7377.0409846719585;7396.852062958818;6535.117759102651;6542.509311801729;6616.172978377703;6668.866622667422;6722.361375669304;6561.081448597105;6600.174978127734;6620.437262832713;6692.665366731547;6712.630805305755;6858.725650973905;6865.41643960269;6905.136857892763;6911.205211400753;6911.654417279015;6124.908126378019;6332;6444.516661250331;6450.516211284266;6459.773907913201;6455.580387274812;6514.348565143448;6520.804375868732;6542.869142617216;6565.573237739532 07:18:59 INFO - PROCESS | 14734 | |4;prototype.html;303.91490382692854;304.84605274336457;311.4565083928545;315.30789916134086;319.3262216722715;6183.474404675602;6212.161358216639;6365.713542890569;6411.903821442682;6462.547621666486;6253.781117660883;6272.090546870701;6289.748410063592;6292.433680968712;6316.147320111795;4628.629709623239;4724.834630787923;4730.739809310487;4732.881677958053;4749.4063242094735;4672.532746725335;4704.97647511762;4745.6440766942615;4750.382450281459;4765.42814862217;4723.976380118094;4734;4739.834105806298;4748.0978614063215;4760.285957106427;4732.881677958044;4744.928826067595;4759.048190361924;4759.095771803381;4767.90464190716;4130.938035929464;4154.31453810121;4161.188568229197;4161.2301724181125;4162.583741625844;5835.124731290298;5898.672798620319;5904.114382842565;5929.873324068413;5930.911036334458;5286.762095705702;5456.7544460499375;5462.863428414282;5474.39781624021;5538.113901775737;6607.768728094542;6617.239017512999;6629.966850165718;6635.369639884203;6657.434118099967;4475.70907890986;4477.5746304101385;4489.438820147481;4492.460904691458;4495.797689103965;6881.449484041264;6914.51598388108;6952.513324067318;6968.79093627192;6976.127984002;4713.128071306819;4716.693414928087;4719.551642593948;4734.337192793012;4736.668433209711;4617;4696.81212751493;4699.78850951708;4702.224133018014;4779.880502987453;5409.43200963901;5435.592330575223;5486;5510.366307874646;5519.089350257243;6619.602823830585;6686.09737685416;6696.933030669728;6698.095757072831;6704.061431399608;1659.9253033613516;1691.4756425508133;1691.577105723569;1699.5666105143357;1700.3623641134575;1081.7511972246427;1089.5587287148717;1112.3770688414513;1123.118352093619;1140.8516892804048;6375.776847810304;6387.712552935129;6397.264314603787;6415.647139407284;6425.646589437626;6777.423918966844;6820;6822.829429264308;6838.452923766087;6848.657567121624;6252.437280644764;6335.809925702236;6359.523035772336;6365.61806291624;6393.392627700361;3668.724845636588;3740.6633402993316;3753.6809371203753;3754.0614846288427;3773.2830762155104;7362.8527429451115;7376.631168441557;7379.594122323324;7415.369693575999;7419.480636355512;7059.435245180373;7066.081409416845;7071.611061391673;7114.430845532345;7126.750563730245;7207.351338379571;7383.963080184565;7405;7412.481126321213;7461.888071678821;6885.552439091443;6916.619585922621;6952.235254121942;6954.756583519553;6970.337817907291;6847;6855.280195579392;6872.793816185523;6908.723651054102;6915.03189553473;7356.668949897375;7423.665935033045;7432.3310902019075;7435.03344565203;7438.070241219848;4454.5990860822685;4482.574155455227;4507.09858028389;4538.546145385435;4543.954560454353;6900.551464154814;6930.653467326512;6936.583804971718;6943.47923905699;6950.756723514855;6606.207255129415;6689.565178263398;6700.49746269022;6701.1623547056615;6704.564203326768;6586.70359833799;6642.667866606554;6700;6705.865882682417;6712.093867327848;6414.839629009125;6502.219733631994;6522.673866306571;6559.311272316338;6585.045168450452;6633.70148343316;6638.468922486093;6644.10304608891;6645.401913827779;6672.799816005528;6574.356410897276;6574.4740420765265;6577.572457790228;6581.967090164519;6584.176977877765 07:18:59 INFO - PROCESS | 14734 | |5;yui.html;768.9461737678362;800.3317230112856;830.4021104804539;833.0752864320604;847.7244895408994;15698.293576789043;15910.443134490295;15954.760678589815;15964.600884977866;15970.76043859343;14525.78211326831;15057.774133388008;15084.32120554575;15093.471728489505;15284.923575382107;802.9718959836378;809.1544336168718;809.6316176139842;810.1655295046082;812.585581353511;809.6518497046268;816.4162623724036;817.5176645778989;818.6316157729016;824.3034635732796;848.3340577646518;854.5129276312505;859.4843094143527;860.4364141487335;860.6815478273048;842.6755699055847;845.8519759042143;848.5926755157498;851.1743608699583;853.0871966995318;624.5940138909699;631.649434563817;635.9745610175587;637.3881074168803;637.7066549387288;13760.31198440084;13774.380152893144;13793.310334483336;13813.309334533233;13867.722645547032;12526;12784.296863672495;12809.423575939105;12827.166234194747;12995.545155919592;10995.780084398268;11002.174836887185;11021.559137634486;11217.775644487147;11613.535458581646;3572.231970126409;3602.981985090084;3635.600083990759;3691.907702307437;3854.3447613905705;52003.219951700376;52137.2179417309;52489.2126618101;53012.20481692778;53461.73269133629;10138.083924009072;10153;10279.74300642475;10355.792884142274;10370.118539924191;18700.625987480173;18739.812601873808;18756.906215468836;18802;18818.717719234224;7425.368843648351;7481.8877716834295;7687.500312479783;7699.422543309274;7737.922620773833;4031.536373317106;4107.240160570304;4118.485189351331;4126.628603425706;4201.411802347674;3000.159955212544;3039.6200474940633;3060.4032213718556;3060.648025477054;3067.8772849085785;534.1853673148402;545.9235707001023;549.5905550365004;551.0439387662402;554.7170942819191;548.0682839173421;555.7888002559001;591.6745789815584;620.4151321732401;634.8285962790113;8282.875756863652;8383;8439.789005274917;8634.093420190915;8702.34732395073;583.6293953339575;586.3989410853909;596.8716725903952;604.4892066204051;713.5575942915322;3961.3067713150085;3990.3615421532418;4027.838886444568;4058.512978442606;4071.1043570414463;56463.15305270424;58020;58102.12846807301;58245.41754582485;58302.7084864573;52115;52515;52517.7374113127;53014.46985530172;54049.72975135099;49085.50914490881;49091.263631045564;49174.754126229855;49448.25827612589;49819.25271120936;7716.266954639525;7740.806479838049;7913.9604301978125;7915;7921.722739704082;33273.66726332706;33306.500402494465;33382.49926251157;33641.327173456884;34104.48843267403;39695.20609587734;39759;42362.57637423586;42454.15091698087;42742;10342.37945723259;10423.843642345522;10636.30863993838;10741.033307002408;11241.269317494336;11809.940950295537;11914.940425297818;12357.38213089324;12758.872411275768;12963.935180324039;11047.72380690489;11111.555537778399;11156.10751139923;11428.428578571204;11767.76464470723;10830.945845270724;11179.832302515631;11197.552097915992;11378.715532111764;11602.18784685064;10864.674059778219;11059.281146725438;11084.16868734832;11245.662630121109;11725.151716808561;9811.656592019244;10118.342307749972;10204.591816327264;10282.331648442827;10322.948385258025;8718.215360617574;8988.820223595621;9214.447133171763;9536.284778641491;9598.376105553116 07:18:59 INFO - PROCESS | 14734 | __end_tp_report 07:18:59 INFO - PROCESS | 14734 | __start_cc_report 07:18:59 INFO - PROCESS | 14734 | _x_x_mozilla_cycle_collect,315 07:18:59 INFO - PROCESS | 14734 | __end_cc_report 07:18:59 INFO - PROCESS | 14734 | __startTimestamp1456759139393__endTimestamp 07:18:59 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | ------- Summary: start ------- 07:18:59 INFO - PROCESS | 14734 | Number of tests: 6 07:18:59 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | [#0] dojo.html Cycles:165 Average:5123.01 Median:5359.60 stddev:680.30 (12.7%) stddev-sans-first:664.51 07:18:59 INFO - PROCESS | 14734 | Values: 3148.2 3193.8 3222.7 3227.9 3245.1 5027.4 5117.9 5123.9 5162.8 5192.1 5009.4 5017.5 5045.7 5189.4 5244.2 98.8 4694.1 4758.0 4759.6 4794.1 4589.9 4671.0 4703.2 4713.4 4754.1 4788.7 4789.9 4796.1 4802.5 4861.7 4796.0 4810.7 4817.6 4823.4 4856.2 4644.6 4688.0 4701.4 4750.5 4768.9 5048.9 5069.7 5081.0 5129.3 5133.3 5359.6 5610.1 5628.8 5631.5 5638.8 5529.2 5548.4 5554.7 5564.8 5629.2 5126.5 5195.4 5196.7 5197.4 5247.3 5518.6 5644.9 5647.0 5650.4 5653.9 5349.9 5375.7 5382.2 5428.1 5429.0 5445.1 5445.9 5462.9 5465.5 5499.3 5336.1 5393.7 5440.2 5451.6 5474.5 5479.5 5506.6 5507.8 5520.2 5554.8 4202.5 4203.2 4238.5 4269.7 4282.8 3761.0 3785.5 3811.6 3892.1 3906.5 5219.8 5307.7 5357.7 5364.2 5379.0 5597.9 5636.2 5646.8 5647.9 5652.2 5073.0 5258.6 5300.4 5312.0 5342.9 4688.3 4697.2 4698.2 4698.5 4701.1 5786.0 5803.7 5816.7 5819.2 5833.3 5364.8 5372.9 5464.5 5501.6 5530.4 5754.5 5794.1 5805.3 5838.5 5847.4 5348.2 5492.5 5498.8 5512.6 5532.5 5479.6 5522.6 5531.2 5566.2 5582.7 5348.0 5372.7 5377.5 5407.1 5434.3 5257.1 5394.7 5407.0 5459.1 5482.1 5316.3 5347.2 5374.8 5382.6 5423.2 5375.2 5397.8 5412.3 5445.1 5487.0 5128.3 5280.0 5311.2 5379.2 5379.9 07:18:59 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | [#1] ext.html Cycles:180 Average:44186.70 Median:36764.54 stddev:70394.62 (191.5%) stddev-sans-first:70515.66 07:18:59 INFO - PROCESS | 14734 | Values: 494.5 521.5 521.6 538.5 540.8 36188.0 36618.6 36718.3 36835.6 36975.3 39410.4 39717.6 39811.6 39909.0 39923.2 8373.1 8587.2 8608.3 8621.4 8630.6 8407.4 8445.0 8500.4 8766.4 8808.5 8725.6 8751.3 8751.4 8820.5 8831.4 8715.8 8782.6 8788.8 8804.4 8816.8 8618.7 8662.6 8683.1 8731.4 8780.5 39441.2 39796.2 40236.6 40262.6 40459.8 2852.6 3201.6 3315.3 4081.6 4187.6 26958.7 27227.9 27980.0 28423.7 28432.0 3690.9 3701.5 3743.2 3755.8 3777.2 210412.0 211355.0 211832.0 212341.0 212678.0 56550.6 56749.7 56817.0 57015.0 57097.1 59792.7 59902.4 65738.7 66215.0 67053.0 14374.8 14595.9 14632.5 14642.1 14647.8 10709.8 10771.8 10772.6 10780.6 10836.9 19732.7 20492.8 20681.4 20752.0 20808.8 7870.8 8361.5 8373.6 8418.5 8431.0 1071.2 1080.3 1084.1 1121.6 1138.0 28181.6 28653.4 28923.7 28927.0 29151.0 1118.2 1120.0 1125.9 1129.4 1138.2 14573.6 14922.3 15013.3 15150.9 15210.2 298265.0 301822.0 302980.0 305404.0 306476.0 51432.2 52203.0 52273.7 52498.2 52522.0 1301.9 1344.3 1347.1 1349.2 1352.7 27335.0 28591.9 28749.0 28853.4 28887.4 46084.3 46189.0 46307.0 46324.3 46628.8 284329.0 284683.0 286303.0 286411.0 287021.0 31910.8 31978.8 32594.0 32830.0 32842.7 42945.0 43540.8 44122.6 44168.8 44405.8 36361.3 36979.0 37076.6 37851.0 38077.6 36383.0 36431.5 36810.8 36976.3 37096.8 36055.9 36561.8 38660.4 38738.2 38842.0 29722.9 31068.2 32468.2 34141.6 34391.0 24874.9 25174.2 25515.7 25610.7 25793.4 07:18:59 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | [#2] jquery.html Cycles:180 Average:24419.83 Median:40091.00 stddev:67840.54 (169.2%) stddev-sans-first:68006.77 07:18:59 INFO - PROCESS | 14734 | Values: 350.3 351.5 353.4 355.9 356.8 16251.5 16774.9 17225.9 17712.1 17741.6 13300.5 13692.0 16405.2 16431.1 16501.6 5161.8 5236.5 5356.0 5448.3 5468.6 3823.8 5365.7 5565.5 5590.2 5616.8 5591.7 5605.8 5624.9 5633.8 5633.9 5443.6 5627.7 5629.6 5673.0 5684.5 5385.1 5444.2 5456.4 5461.9 5523.9 17461.5 20835.6 20976.0 21087.0 21100.1 2175.4 2206.9 2339.9 2350.3 2772.2 9509.5 9558.6 9593.6 9754.0 9858.8 1822.3 1916.1 1934.7 1940.7 1957.3 59065.0 64565.0 66332.0 66923.7 67817.7 9936.9 10069.2 10232.7 10287.6 10404.3 13281.5 13425.8 13440.7 13538.9 13573.7 7325.5 7389.4 7420.6 7483.6 7505.1 7106.5 7205.0 7311.0 7362.9 7502.2 4510.9 4575.6 4578.7 4640.7 4661.1 1840.8 1878.2 1926.4 1933.7 1946.2 940.0 959.2 962.6 986.2 1026.9 16472.8 16480.1 16913.9 17011.7 17085.8 862.4 913.7 939.1 959.2 986.7 8774.6 8951.9 8971.6 9111.8 9283.8 408167.0 411222.0 412506.0 416662.0 416831.0 72749.0 76519.2 76700.0 76805.0 79025.6 1013.1 1021.9 1028.9 1029.8 1057.3 14281.7 14295.9 14377.9 14580.5 14624.6 30185.7 31203.0 31337.5 31508.7 33168.7 39833.8 40087.2 40094.8 40190.6 40883.6 7914.9 8017.4 8181.7 8430.3 8460.6 8972.0 12019.2 12109.5 12417.3 12593.0 10060.5 10157.4 10272.7 10388.2 10850.7 10748.4 10788.7 10792.2 10891.6 11047.8 10441.0 10771.8 10886.2 10954.6 11027.2 8211.5 8235.1 8251.2 8365.1 8400.7 9592.2 10767.9 10927.6 10997.3 11034.2 07:18:59 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | [#3] mootools.html Cycles:180 Average:5307.34 Median:6453.05 stddev:2812.55 (43.6%) stddev-sans-first:2805.71 07:18:59 INFO - PROCESS | 14734 | Values: 1477.3 1482.3 1644.6 1741.0 1777.7 6695.8 7448.5 7510.3 7682.2 7751.1 7525.7 7544.0 7708.3 7722.8 7732.8 2093.9 2095.0 2100.2 2112.9 2117.4 2103.6 2113.9 2190.3 2203.5 2203.8 2080.2 2101.8 2112.2 2112.5 2167.0 2145.4 2158.4 2159.3 2161.4 2175.7 2114.5 2166.1 2168.5 2172.0 2176.5 7582.0 7604.3 7614.2 7639.6 7641.4 4327.4 4443.0 4447.2 4468.8 4481.1 2876.0 2883.8 2964.0 2975.4 3014.3 903.3 921.2 944.2 946.8 947.5 10552.4 10564.4 10640.3 10694.3 10736.3 3822.0 3913.0 3927.1 3931.1 4012.9 8081.8 8123.4 8132.4 8137.6 8140.5 4226.7 4270.8 4274.2 4278.9 4280.8 3812.8 3904.8 3925.7 3942.8 3974.8 3274.7 3324.2 3333.7 3378.3 3380.4 984.8 1001.2 1006.7 1008.6 1026.3 1275.1 1276.4 1285.1 1289.8 1330.3 7161.5 7297.7 7329.3 7337.8 7343.7 1035.9 1040.0 1044.7 1045.8 1075.2 5780.1 5822.2 5856.2 5868.6 5883.3 9229.3 9291.4 9522.1 9547.0 9595.0 9293.2 9359.3 9401.1 9425.7 9472.1 7298.6 7311.9 7352.7 7388.3 7409.9 7051.4 7057.2 7125.9 7143.0 7143.5 8207.1 8307.0 8432.6 8496.0 8574.3 8669.0 8740.9 8748.3 8761.0 8785.2 5669.1 6200.8 6311.6 6563.3 6595.6 7294.1 7311.1 7352.7 7377.0 7396.9 6535.1 6542.5 6616.2 6668.9 6722.4 6561.1 6600.2 6620.4 6692.7 6712.6 6858.7 6865.4 6905.1 6911.2 6911.7 6124.9 6332.0 6444.5 6450.5 6459.8 6455.6 6514.3 6520.8 6542.9 6565.6 07:18:59 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | [#4] prototype.html Cycles:180 Average:5575.03 Median:6365.67 stddev:1721.97 (27.1%) stddev-sans-first:1680.73 07:18:59 INFO - PROCESS | 14734 | Values: 303.9 304.8 311.5 315.3 319.3 6183.5 6212.2 6365.7 6411.9 6462.5 6253.8 6272.1 6289.7 6292.4 6316.1 4628.6 4724.8 4730.7 4732.9 4749.4 4672.5 4705.0 4745.6 4750.4 4765.4 4724.0 4734.0 4739.8 4748.1 4760.3 4732.9 4744.9 4759.0 4759.1 4767.9 4130.9 4154.3 4161.2 4161.2 4162.6 5835.1 5898.7 5904.1 5929.9 5930.9 5286.8 5456.8 5462.9 5474.4 5538.1 6607.8 6617.2 6630.0 6635.4 6657.4 4475.7 4477.6 4489.4 4492.5 4495.8 6881.4 6914.5 6952.5 6968.8 6976.1 4713.1 4716.7 4719.6 4734.3 4736.7 4617.0 4696.8 4699.8 4702.2 4779.9 5409.4 5435.6 5486.0 5510.4 5519.1 6619.6 6686.1 6696.9 6698.1 6704.1 1659.9 1691.5 1691.6 1699.6 1700.4 1081.8 1089.6 1112.4 1123.1 1140.9 6375.8 6387.7 6397.3 6415.6 6425.6 6777.4 6820.0 6822.8 6838.5 6848.7 6252.4 6335.8 6359.5 6365.6 6393.4 3668.7 3740.7 3753.7 3754.1 3773.3 7362.9 7376.6 7379.6 7415.4 7419.5 7059.4 7066.1 7071.6 7114.4 7126.8 7207.4 7384.0 7405.0 7412.5 7461.9 6885.6 6916.6 6952.2 6954.8 6970.3 6847.0 6855.3 6872.8 6908.7 6915.0 7356.7 7423.7 7432.3 7435.0 7438.1 4454.6 4482.6 4507.1 4538.5 4544.0 6900.6 6930.7 6936.6 6943.5 6950.8 6606.2 6689.6 6700.5 6701.2 6704.6 6586.7 6642.7 6700.0 6705.9 6712.1 6414.8 6502.2 6522.7 6559.3 6585.0 6633.7 6638.5 6644.1 6645.4 6672.8 6574.4 6574.5 6577.6 6582.0 6584.2 07:18:59 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | [#5] yui.html Cycles:180 Average:14075.30 Median:23281.99 stddev:16332.51 (70.2%) stddev-sans-first:16347.76 07:18:59 INFO - PROCESS | 14734 | Values: 768.9 800.3 830.4 833.1 847.7 15698.3 15910.4 15954.8 15964.6 15970.8 14525.8 15057.8 15084.3 15093.5 15284.9 803.0 809.2 809.6 810.2 812.6 809.7 816.4 817.5 818.6 824.3 848.3 854.5 859.5 860.4 860.7 842.7 845.9 848.6 851.2 853.1 624.6 631.6 636.0 637.4 637.7 13760.3 13774.4 13793.3 13813.3 13867.7 12526.0 12784.3 12809.4 12827.2 12995.5 10995.8 11002.2 11021.6 11217.8 11613.5 3572.2 3603.0 3635.6 3691.9 3854.3 52003.2 52137.2 52489.2 53012.2 53461.7 10138.1 10153.0 10279.7 10355.8 10370.1 18700.6 18739.8 18756.9 18802.0 18818.7 7425.4 7481.9 7687.5 7699.4 7737.9 4031.5 4107.2 4118.5 4126.6 4201.4 3000.2 3039.6 3060.4 3060.6 3067.9 534.2 545.9 549.6 551.0 554.7 548.1 555.8 591.7 620.4 634.8 8282.9 8383.0 8439.8 8634.1 8702.3 583.6 586.4 596.9 604.5 713.6 3961.3 3990.4 4027.8 4058.5 4071.1 56463.2 58020.0 58102.1 58245.4 58302.7 52115.0 52515.0 52517.7 53014.5 54049.7 49085.5 49091.3 49174.8 49448.3 49819.3 7716.3 7740.8 7914.0 7915.0 7921.7 33273.7 33306.5 33382.5 33641.3 34104.5 39695.2 39759.0 42362.6 42454.2 42742.0 10342.4 10423.8 10636.3 10741.0 11241.3 11809.9 11914.9 12357.4 12758.9 12963.9 11047.7 11111.6 11156.1 11428.4 11767.8 10830.9 11179.8 11197.6 11378.7 11602.2 10864.7 11059.3 11084.2 11245.7 11725.2 9811.7 10118.3 10204.6 10282.3 10322.9 8718.2 8988.8 9214.4 9536.3 9598.4 07:18:59 INFO - PROCESS | 14734 | -------- Summary: end -------- 07:18:59 INFO - PROCESS | 14734 | 07:18:59 INFO - PROCESS | 14734 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:18:59 INFO - PROCESS | 14734 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:18:59 INFO - PROCESS | 14734 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:18:59 INFO - PROCESS | 14734 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:18:59 INFO - PROCESS | 14734 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:18:59 INFO - PROCESS | 14734 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:18:59 INFO - PROCESS | 14734 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:18:59 INFO - PROCESS | 14734 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:00 INFO - TEST-INFO | 14734: exit 0 07:19:00 INFO - TEST-OK | dromaeo_css | took 1109651ms 07:19:00 INFO - TEST-START | kraken 07:19:00 INFO - operating with platform_type : linux_ 07:19:00 INFO - Initialising browser for kraken test... 07:19:00 INFO - TEST-INFO | started process 14972 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpraA7q2/profile http://localhost:42846/getInfo.html) 07:19:03 INFO - PROCESS | 14972 | 07:19:03 INFO - PROCESS | 14972 | (process:15044): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:19:04 INFO - PROCESS | 14972 | __metrics Screen width/height:1600/1200 07:19:04 INFO - PROCESS | 14972 | colorDepth:24 07:19:04 INFO - PROCESS | 14972 | Browser inner width/height: 1024/697 07:19:04 INFO - PROCESS | 14972 | __metrics 07:19:05 ERROR - PROCESS | 14972 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2849: TypeError: this.tabs is undefined 07:19:05 INFO - PROCESS | 14972 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:05 INFO - PROCESS | 14972 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:05 INFO - PROCESS | 14972 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:05 INFO - PROCESS | 14972 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:05 INFO - PROCESS | 14972 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:05 INFO - PROCESS | 14972 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:05 INFO - PROCESS | 14972 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:05 INFO - PROCESS | 14972 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:05 INFO - PROCESS | 14972 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:19:06 INFO - TEST-INFO | 14972: exit 0 07:19:06 INFO - Browser initialized. 07:19:06 INFO - Running cycle 1/1 for kraken test... 07:19:06 INFO - TEST-INFO | started process 15095 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpraA7q2/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:19:07 INFO - PROCESS | 15095 | 07:19:07 INFO - PROCESS | 15095 | (process:15152): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 07:19:18 INFO - PROCESS | 15095 | RSS: Main: 160718848 07:19:18 INFO - PROCESS | 15095 | 07:19:20 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42846/tests/kraken/driver.html?testName=audio-beat-detection) 07:19:21 INFO - PROCESS | 15095 | RSS: Main: 167219200 07:19:21 INFO - PROCESS | 15095 | 07:19:24 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42846/tests/kraken/driver.html?testName=audio-dft) 07:19:24 INFO - PROCESS | 15095 | RSS: Main: 169934848 07:19:24 INFO - PROCESS | 15095 | 07:19:27 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42846/tests/kraken/driver.html?testName=audio-fft) 07:19:28 INFO - PROCESS | 15095 | RSS: Main: 162848768 07:19:28 INFO - PROCESS | 15095 | 07:19:30 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42846/tests/kraken/driver.html?testName=audio-oscillator) 07:19:30 INFO - PROCESS | 15095 | RSS: Main: 163880960 07:19:30 INFO - PROCESS | 15095 | 07:19:33 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42846/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:19:33 INFO - PROCESS | 15095 | RSS: Main: 162693120 07:19:33 INFO - PROCESS | 15095 | 07:19:36 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42846/tests/kraken/driver.html?testName=imaging-darkroom) 07:19:37 INFO - PROCESS | 15095 | RSS: Main: 163708928 07:19:37 INFO - PROCESS | 15095 | 07:19:40 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42846/tests/kraken/driver.html?testName=imaging-desaturate) 07:19:41 INFO - PROCESS | 15095 | RSS: Main: 164171776 07:19:41 INFO - PROCESS | 15095 | 07:19:44 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42846/tests/kraken/driver.html?testName=json-parse-financial) 07:19:44 INFO - PROCESS | 15095 | RSS: Main: 166621184 07:19:44 INFO - PROCESS | 15095 | 07:19:46 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42846/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:19:46 INFO - PROCESS | 15095 | RSS: Main: 165187584 07:19:46 INFO - PROCESS | 15095 | 07:19:48 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42846/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:19:49 INFO - PROCESS | 15095 | RSS: Main: 165961728 07:19:49 INFO - PROCESS | 15095 | 07:19:51 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42846/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:19:52 INFO - PROCESS | 15095 | RSS: Main: 165560320 07:19:52 INFO - PROCESS | 15095 | 07:19:54 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42846/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:19:55 INFO - PROCESS | 15095 | RSS: Main: 166256640 07:19:55 INFO - PROCESS | 15095 | 07:19:57 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42846/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:19:58 INFO - PROCESS | 15095 | RSS: Main: 167100416 07:19:58 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | Cycle 1(1): loaded http://localhost:42846/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42846/tests/kraken/driver.html?testName=ai-astar) 07:20:00 INFO - PROCESS | 15095 | RSS: Main: 167780352 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | __start_tp_report 07:20:00 INFO - PROCESS | 15095 | _x_x_mozilla_page_load 07:20:00 INFO - PROCESS | 15095 | _x_x_mozilla_page_load_details 07:20:00 INFO - PROCESS | 15095 | |i|pagename|runs| 07:20:00 INFO - PROCESS | 15095 | |0;ai-astar;112;110;112;113;114;125;113;111;112;112 07:20:00 INFO - PROCESS | 15095 | |1;audio-beat-detection;159;129;151;164;138;160;150;142;174;126 07:20:00 INFO - PROCESS | 15095 | |2;audio-dft;161;163;160;162;164;162;164;166;167;162 07:20:00 INFO - PROCESS | 15095 | |3;audio-fft;74;75;72;73;72;74;73;140;73;77 07:20:00 INFO - PROCESS | 15095 | |4;audio-oscillator;96;96;150;95;96;95;153;95;96;142 07:20:00 INFO - PROCESS | 15095 | |5;imaging-gaussian-blur;119;116;115;115;116;115;115;115;115;116 07:20:00 INFO - PROCESS | 15095 | |6;imaging-darkroom;147;147;147;146;147;147;146;147;147;149 07:20:00 INFO - PROCESS | 15095 | |7;imaging-desaturate;97;97;96;97;96;96;97;96;97;96 07:20:00 INFO - PROCESS | 15095 | |8;json-parse-financial;59;56;58;56;58;56;57;58;58;55 07:20:00 INFO - PROCESS | 15095 | |9;json-stringify-tinderbox;70;68;68;68;69;67;67;68;68;68 07:20:00 INFO - PROCESS | 15095 | |10;stanford-crypto-aes;84;85;84;86;85;83;83;84;85;84 07:20:00 INFO - PROCESS | 15095 | |11;stanford-crypto-ccm;119;119;118;118;122;122;144;128;120;117 07:20:00 INFO - PROCESS | 15095 | |12;stanford-crypto-pbkdf2;146;156;151;152;154;151;152;153;156;139 07:20:00 INFO - PROCESS | 15095 | |13;stanford-crypto-sha256-iterative;69;73;72;69;73;71;70;71;68;67 07:20:00 INFO - PROCESS | 15095 | __end_tp_report 07:20:00 INFO - PROCESS | 15095 | __start_cc_report 07:20:00 INFO - PROCESS | 15095 | _x_x_mozilla_cycle_collect,796 07:20:00 INFO - PROCESS | 15095 | __end_cc_report 07:20:00 INFO - PROCESS | 15095 | __startTimestamp1456759200340__endTimestamp 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | ------- Summary: start ------- 07:20:00 INFO - PROCESS | 15095 | Number of tests: 14 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#0] ai-astar Cycles:10 Average:113.40 Median:112.50 stddev:4.22 (3.8%) stddev-sans-first:4.45 07:20:00 INFO - PROCESS | 15095 | Values: 112.0 110.0 112.0 113.0 114.0 125.0 113.0 111.0 112.0 112.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#1] audio-beat-detection Cycles:10 Average:149.30 Median:155.00 stddev:15.54 (10.0%) stddev-sans-first:16.08 07:20:00 INFO - PROCESS | 15095 | Values: 159.0 129.0 151.0 164.0 138.0 160.0 150.0 142.0 174.0 126.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#2] audio-dft Cycles:10 Average:163.10 Median:163.50 stddev:2.18 (1.3%) stddev-sans-first:2.18 07:20:00 INFO - PROCESS | 15095 | Values: 161.0 163.0 160.0 162.0 164.0 162.0 164.0 166.0 167.0 162.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#3] audio-fft Cycles:10 Average:80.30 Median:73.50 stddev:21.03 (28.6%) stddev-sans-first:22.18 07:20:00 INFO - PROCESS | 15095 | Values: 74.0 75.0 72.0 73.0 72.0 74.0 73.0 140.0 73.0 77.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#4] audio-oscillator Cycles:10 Average:111.40 Median:95.50 stddev:25.63 (26.8%) stddev-sans-first:26.57 07:20:00 INFO - PROCESS | 15095 | Values: 96.0 96.0 150.0 95.0 96.0 95.0 153.0 95.0 96.0 142.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#5] imaging-gaussian-blur Cycles:10 Average:115.70 Median:115.50 stddev:1.25 (1.1%) stddev-sans-first:0.50 07:20:00 INFO - PROCESS | 15095 | Values: 119.0 116.0 115.0 115.0 116.0 115.0 115.0 115.0 115.0 116.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#6] imaging-darkroom Cycles:10 Average:147.00 Median:147.00 stddev:0.82 (0.6%) stddev-sans-first:0.87 07:20:00 INFO - PROCESS | 15095 | Values: 147.0 147.0 147.0 146.0 147.0 147.0 146.0 147.0 147.0 149.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#7] imaging-desaturate Cycles:10 Average:96.50 Median:97.00 stddev:0.53 (0.5%) stddev-sans-first:0.53 07:20:00 INFO - PROCESS | 15095 | Values: 97.0 97.0 96.0 97.0 96.0 96.0 97.0 96.0 97.0 96.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#8] json-parse-financial Cycles:10 Average:57.10 Median:58.00 stddev:1.29 (2.2%) stddev-sans-first:1.17 07:20:00 INFO - PROCESS | 15095 | Values: 59.0 56.0 58.0 56.0 58.0 56.0 57.0 58.0 58.0 55.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#9] json-stringify-tinderbox Cycles:10 Average:68.10 Median:68.00 stddev:0.88 (1.3%) stddev-sans-first:0.60 07:20:00 INFO - PROCESS | 15095 | Values: 70.0 68.0 68.0 68.0 69.0 67.0 67.0 68.0 68.0 68.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#10] stanford-crypto-aes Cycles:10 Average:84.30 Median:84.50 stddev:0.95 (1.1%) stddev-sans-first:1.00 07:20:00 INFO - PROCESS | 15095 | Values: 84.0 85.0 84.0 86.0 85.0 83.0 83.0 84.0 85.0 84.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#11] stanford-crypto-ccm Cycles:10 Average:122.70 Median:121.00 stddev:8.12 (6.7%) stddev-sans-first:8.51 07:20:00 INFO - PROCESS | 15095 | Values: 119.0 119.0 118.0 118.0 122.0 122.0 144.0 128.0 120.0 117.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:151.00 Median:152.50 stddev:5.10 (3.3%) stddev-sans-first:5.08 07:20:00 INFO - PROCESS | 15095 | Values: 146.0 156.0 151.0 152.0 154.0 151.0 152.0 153.0 156.0 139.0 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.30 Median:71.00 stddev:2.06 (2.9%) stddev-sans-first:2.13 07:20:00 INFO - PROCESS | 15095 | Values: 69.0 73.0 72.0 69.0 73.0 71.0 70.0 71.0 68.0 67.0 07:20:00 INFO - PROCESS | 15095 | -------- Summary: end -------- 07:20:00 INFO - PROCESS | 15095 | 07:20:00 INFO - PROCESS | 15095 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:20:00 INFO - PROCESS | 15095 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:20:00 INFO - PROCESS | 15095 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:20:00 INFO - PROCESS | 15095 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:20:00 INFO - PROCESS | 15095 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:20:00 INFO - PROCESS | 15095 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:20:00 INFO - PROCESS | 15095 | nsHttpConnectionMgr::Shutdown() ProcessNextEvent 07:20:01 INFO - TEST-INFO | 15095: exit 0 07:20:01 INFO - TEST-OK | kraken | took 61223ms 07:20:01 INFO - SUITE-END | took 1170s 07:20:01 INFO - Completed test suite (00:19:31) 07:20:01 INFO - Working with test: dromaeo_css 07:20:01 INFO - Generating results file: dromaeo_css 07:20:01 INFO - Working with test: kraken 07:20:01 INFO - Generating results file: kraken 07:20:01 INFO - javascript benchmark 07:20:01 INFO - Posting result 0 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:20:01 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,1,43]] 07:20:01 INFO - process_Request line: dromaeo_css 6887.84 graph.html#tests=[[72,1,43]] 07:20:01 INFO - Posting result 1 of 2 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:20:01 INFO - process_Request line: kraken 1530.20 graph.html#tests=[[232,1,43]] 07:20:01 INFO - RETURN: dromaeo_css: 6887.84 07:20:01 INFO - RETURN: kraken: 1530.20 07:20:01 INFO - javascript benchmark 07:20:01 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3148.212946763309, 3193.776435649504, 3222.7099561039504, 3227.8547465364063, 3245.1075954112616, 5027.371578552681, 5117.897642047162, 5123.948760512399, 5162.767675454605, 5192.1432963560965, 5009.398872135349, 5017.498250174981, 5045.697258164512, 5189.377274727038, 5244.213367994793, 98.75035480954779, 4694.08465349257, 4757.976210118962, 4759.571638552529, 4794.137055330039, 4589.885252868671, 4671.042436300567, 4703.176944034797, 4713.38725965624, 4754.120487709767, 4788.712677239359, 4789.880252993686, 4796.08874313881, 4802.471728109905, 4861.73260470674, 4796.0, 4810.711357318537, 4817.638677099197, 4823.445303790038, 4856.150173719585, 4644.6052085572765, 4688.038952014829, 4701.435827700664, 4750.501197374295, 4768.880777980544, 5048.924266136011, 5069.746512674352, 5081.0, 5129.25625784263, 5133.332666753336, 5359.598030147716, 5610.074337734269, 5628.774849006035, 5631.465010823965, 5638.830835074954, 5529.170624406331, 5548.4174161713245, 5554.666719996772, 5564.8330550083565, 5629.211910332557, 5126.53861152498, 5195.402528709171, 5196.714180720059, 5197.428282888879, 5247.265382846443, 5518.558515318765, 5644.85887852807, 5647.0, 5650.434956504317, 5653.9151912721345, 5349.866253343697, 5375.6774593524515, 5382.165764306539, 5428.104362780097, 5428.972855135699, 5445.074337362658, 5445.863853403617, 5462.945370546323, 5465.453454654582, 5499.340079190442, 5336.0661884170895, 5393.6763794172475, 5440.156775699773, 5451.64564303319, 5474.534664553557, 5479.506844384025, 5506.64206826555, 5507.807226747044, 5520.199571062173, 5554.833354999357, 4202.453681021448, 4203.222403855297, 4238.491381034234, 4269.7224680395675, 4282.76444795533, 3760.9623903761158, 3785.488958990501, 3811.5807261201244, 3892.0853599404118, 3906.531216254011, 5219.8434046978655, 5307.708076055854, 5357.732113394315, 5364.168553874156, 5378.97310513445, 5597.860053498695, 5636.210930469738, 5646.830595082154, 5647.943520564824, 5652.236948011966, 5072.9746351268, 5258.605604579672, 5300.416954135042, 5311.973440132774, 5342.9465705342445, 4688.2733176357715, 4697.154512187839, 4698.201305777958, 4698.483166851644, 4701.059788042405, 5785.971070144707, 5803.738831752581, 5816.738246778905, 5819.185314056035, 5833.270841144857, 5364.812231571798, 5372.865678358073, 5464.453554644504, 5501.587380946365, 5530.419305972815, 5754.4533269339345, 5794.072948328248, 5805.332386775406, 5838.532917366516, 5847.356790753099, 5348.197770334481, 5492.47821456961, 5498.80754173602, 5512.614117011931, 5532.529734972572, 5479.561635069105, 5522.6134170607675, 5531.225628411945, 5566.22072909801, 5582.720863956704, 5348.0, 5372.650777699437, 5377.542908852635, 5407.134858422633, 5434.293541839694, 5257.132573125545, 5394.703291319015, 5406.972675191701, 5459.099248623933, 5482.068048431696, 5316.255724198538, 5347.171188465794, 5374.838754837361, 5382.596305277041, 5423.2407462954425, 5375.247465354775, 5397.78408863641, 5412.269343638558, 5445.128779395278, 5487.039768040497, 5128.307678463509, 5280.023195708806, 5311.150215965427, 5379.220013098157, 5379.892402152013], "unit": "score", "name": "dojo.html", "value": 5083.022059074838}, {"lowerIsBetter": false, "replicates": [494.4610374691588, 521.4785214785214, 521.629642953503, 538.4991957479544, 540.8242321245594, 36187.99999999996, 36618.63381366186, 36718.26563468729, 36835.631643683555, 36975.26049479009, 39410.40884386729, 39717.60282397175, 39811.60188398115, 39909.0, 39923.20153596926, 8373.120822313645, 8587.184217499358, 8608.311335093178, 8621.439606425562, 8630.611622476972, 8407.369447291447, 8445.028821685524, 8500.362472814533, 8766.386352955264, 8808.515531645757, 8725.563721813916, 8751.299896008304, 8751.431156974808, 8820.514871682055, 8831.381803273742, 8715.782105447352, 8782.560871956408, 8788.824223515527, 8804.42771219875, 8816.779580510474, 8618.698345557876, 8662.6101825418, 8683.088275731021, 8731.388802783744, 8780.517071561062, 39441.21117577661, 39796.204075918606, 40236.59763402358, 40262.57111717709, 40459.79770101131, 2852.6006359109742, 3201.5668092249825, 3315.295296387597, 4081.632653061209, 4187.644050255732, 26958.73041269582, 27227.86386068057, 27980.0, 28423.715762842312, 28432.0, 3690.870819521304, 3701.5188025556777, 3743.1952130291847, 3755.7746535207702, 3777.244551089793, 210412.0, 211355.0, 211831.99999999846, 212341.0, 212678.0, 56550.586235344446, 56749.716251419304, 56817.0, 57015.0, 57097.14354284689, 59792.70103649541, 59902.40097599055, 65738.67130664315, 66215.0, 67053.0, 14374.784378234335, 14595.92702036483, 14632.487862924747, 14642.121472711671, 14647.780283295759, 10709.785804284027, 10771.78456430867, 10772.569097236179, 10780.622678206226, 10836.891631083588, 19732.70400943987, 20492.795072049088, 20681.379558613266, 20752.0, 20808.791912080684, 7870.819377093368, 8361.456505327134, 8373.581320933929, 8418.536980466133, 8430.957845210858, 1071.164491696478, 1080.3409919948824, 1084.0514549768952, 1121.6410748560381, 1137.9601713940137, 28181.57727634087, 28653.426931461672, 28923.710762892522, 28927.0, 29151.0, 1118.1502058435647, 1119.9664010079712, 1125.876153623101, 1129.390129330169, 1138.174823253135, 14573.562793116223, 14922.328495217742, 15013.324400401789, 15150.924245378703, 15210.163441010629, 298265.0, 301822.0, 302980.0, 305404.0, 306476.0, 51432.22851657228, 52203.0, 52273.7386313066, 52498.21252681137, 52522.0, 1301.9283939383424, 1344.253939063829, 1347.070521340272, 1349.1770020287813, 1352.668596193919, 27335.0, 28591.85704071466, 28749.0, 28853.42293154167, 28887.42225155443, 46084.30873536832, 46189.0, 46307.0, 46324.30513542367, 46628.7668561655, 284329.0, 284683.0, 286303.0, 286411.0, 287021.0, 31910.84044579762, 31978.84010579932, 32594.0, 32830.0, 32842.67157328492, 42945.0, 43540.78229608832, 44122.558774411846, 44168.779156104014, 44405.77797111123, 36361.27277454489, 36979.0, 37076.62923370732, 37851.0, 38077.61922380741, 36383.0, 36431.45352819763, 36810.8159459201, 36976.26047479089, 37096.814515927246, 36055.918322450365, 36561.81719091388, 38660.420093698056, 38738.225235495695, 38842.0, 29722.85138574293, 31068.22329441782, 32468.188295292806, 34141.61008729365, 34391.0, 24874.875625621757, 25174.24477265685, 25515.744842551336, 25610.71946402635, 25793.355166120247], "unit": "score", "name": "ext.html", "value": 18319.104148755505}, {"lowerIsBetter": false, "replicates": [350.269687701143, 351.51315428132045, 353.3568904593639, 355.88789531297624, 356.8412056634797, 16251.51245462635, 16774.91612541937, 17225.91387043066, 17712.114394280266, 17741.64516709665, 13300.46798128076, 13692.0, 16405.179741012962, 16431.096289704063, 16501.587460313498, 5161.767720452589, 5236.476352364762, 5356.0, 5448.346198456191, 5468.6171967962255, 3823.8279277432443, 5365.704886231256, 5565.471280228372, 5590.245316882229, 5616.803411880585, 5591.664500129985, 5605.775768969257, 5624.887502249952, 5633.845061762328, 5633.887322253552, 5443.618946673734, 5627.6904770237625, 5629.577781666371, 5673.0, 5684.516816070639, 5385.138377859524, 5444.183372494118, 5456.399796022434, 5461.890762184774, 5523.917141242885, 17461.476155715223, 20835.58328833415, 20976.0, 21087.0, 21100.05049772764, 2175.369142948543, 2206.856554323964, 2339.8830058497006, 2350.330155905576, 2772.1942630841436, 9509.476978766164, 9558.569864356052, 9593.568289426992, 9754.0, 9858.753531161707, 1822.271091563372, 1916.1473144450724, 1934.7001214811726, 1940.7088936659613, 1957.3345062678616, 59065.0, 64565.0, 66332.0, 66923.66538167327, 67817.66091169562, 9936.900630993741, 10069.244806639532, 10232.693019209435, 10287.639932602324, 10404.27170098101, 13281.535146269835, 13425.798613020812, 13440.65593440648, 13538.86461135376, 13573.660658483419, 7325.450591205681, 7389.408847292204, 7420.591867447342, 7483.550986940801, 7505.099388073466, 7106.538075025107, 7205.0, 7310.96344518274, 7362.889556656654, 7502.2122677119205, 4510.909781804411, 4575.611073058761, 4578.679492435497, 4640.721556706609, 4661.137689527448, 1840.8251216134445, 1878.2017642501883, 1926.4413320137003, 1933.6712758831034, 1946.2117842273901, 939.9577019034023, 959.1511512311655, 962.5957098018849, 986.2455221755363, 1026.9383836969805, 16472.752908706378, 16480.0935948524, 16913.91543042277, 17011.744823827652, 17085.829141708673, 862.4480332587149, 913.6939125392935, 939.135994884694, 959.1703176752059, 986.6793292180071, 8774.60514276859, 8951.888071599113, 8971.551422428853, 9111.772205694779, 9283.76790580241, 408167.0, 411222.0, 412506.0, 416662.0, 416831.0, 72749.0, 76519.23480765121, 76700.0, 76805.0, 79025.60487197642, 1013.138831992815, 1021.9437930913722, 1028.8919663435381, 1029.809485245232, 1057.3021805608262, 14281.714365712834, 14295.857041429452, 14377.856221437652, 14580.489682861049, 14624.561263162122, 30185.698143019166, 31203.0, 31337.529937050505, 31508.684913150573, 33168.668313317525, 39833.80083099682, 40087.1982560353, 40094.799526002185, 40190.598094018686, 40883.59116408917, 7914.920850791418, 8017.438779285394, 8181.67273309061, 8430.283425908867, 8460.619272132646, 8971.955140224518, 12019.158658894143, 12109.51561937548, 12417.254964702146, 12593.0, 10060.496975151067, 10157.39055656663, 10272.691819245434, 10388.220883433924, 10850.728731781768, 10748.408837514013, 10788.676339709822, 10792.190585706261, 10891.564337426415, 11047.834282485608, 10441.0, 10771.838422423827, 10886.183536234972, 10954.616588419367, 11027.22809403334, 8211.466254693425, 8235.094139644754, 8251.174882511701, 8365.121662225622, 8400.705975290835, 9592.23262139041, 10767.887000574045, 10927.617533386612, 10997.285176463503, 11034.17243706709], "unit": "score", "name": "jquery.html", "value": 8329.943028036}, {"lowerIsBetter": false, "replicates": [1477.2539867366977, 1482.266278192295, 1644.5970737169396, 1740.9825901740994, 1777.662244173607, 6695.799126026215, 7448.478606497547, 7510.324070833624, 7682.231776822322, 7751.108622508414, 7525.698972041112, 7543.962280188605, 7708.30625243728, 7722.806929826757, 7732.806679833007, 2093.947651308722, 2094.958100837986, 2100.180929437513, 2112.8837913914726, 2117.4071260047212, 2103.5582527669208, 2113.9048742806535, 2190.3319487556287, 2203.493196564783, 2203.8457307988447, 2080.1783295598307, 2101.8108370246673, 2112.207922029239, 2112.524681946565, 2167.035669127239, 2145.3885642591863, 2158.3740715192575, 2159.265849611132, 2161.4056134562966, 2175.749788774295, 2114.5242320477923, 2166.1118941234017, 2168.5012447137246, 2171.9674204886937, 2176.4776453651166, 7581.962090189569, 7604.315611594928, 7614.238576142397, 7639.618019099023, 7641.3886889048745, 4327.37253098299, 4443.000324926866, 4447.155040542287, 4468.82124715011, 4481.103779244132, 2875.971240287591, 2883.8125521841225, 2963.970360296391, 2975.4197931403387, 3014.3368458939, 903.2818908967387, 921.1893533690377, 944.2210176604328, 946.7727745341138, 947.4741518457254, 10552.366857988545, 10564.418956957365, 10640.255182137253, 10694.304870183412, 10736.30214036093, 3821.9617803821607, 3913.0021844430057, 3927.096767743435, 3931.0761970936805, 4012.9197416052098, 8081.757547273592, 8123.350131989427, 8132.390070744717, 8137.552434616035, 8140.511569305861, 4226.725262857904, 4270.807813648394, 4274.230638485103, 4278.871633850989, 4280.807363668642, 3812.84748610058, 3904.843806247775, 3925.74482658632, 3942.783146926889, 3974.82113304902, 3274.7052765250764, 3324.1855745342546, 3333.6999670029813, 3378.2567835076243, 3380.4084285249983, 984.8325784616633, 1001.2390583156707, 1006.6577363696379, 1008.621766837436, 1026.2662196529518, 1275.0946827752214, 1276.393712986324, 1285.0875878126635, 1289.7936330187124, 1330.255057167989, 7161.498695091398, 7297.744578939712, 7329.267073292628, 7337.816554586071, 7343.742968996059, 1035.8756949166147, 1039.9740006499746, 1044.6604853422668, 1045.8274384726435, 1075.231209685079, 5780.104083867007, 5822.155787410802, 5856.1508581255475, 5868.589198756046, 5883.264591926009, 9229.261659067259, 9291.396059256127, 9522.0954009369, 9547.0, 9595.0, 9293.210077143383, 9359.298052645943, 9401.059894010545, 9425.71722848302, 9472.052794720474, 7298.635068246673, 7311.89032164518, 7352.742654007084, 7388.335049845432, 7409.851802963911, 7051.365377116084, 7057.2237053925055, 7125.857482850418, 7143.0, 7143.464240181903, 8207.138250483613, 8306.958465207636, 8432.620532076195, 8496.0, 8574.31405487572, 8668.956655216683, 8740.91259087401, 8748.300135988979, 8760.956195218983, 8785.209331160226, 5669.121286200645, 6200.7519699211525, 6311.589746666452, 6563.343665633399, 6595.571287866273, 7294.051773269441, 7311.122665280201, 7352.705891764484, 7377.0409846719585, 7396.852062958818, 6535.117759102651, 6542.509311801729, 6616.172978377703, 6668.866622667422, 6722.361375669304, 6561.081448597105, 6600.174978127734, 6620.437262832713, 6692.665366731547, 6712.630805305755, 6858.725650973905, 6865.41643960269, 6905.136857892763, 6911.205211400753, 6911.654417279015, 6124.908126378019, 6332.0, 6444.516661250331, 6450.516211284266, 6459.773907913201, 6455.580387274812, 6514.348565143448, 6520.804375868732, 6542.869142617216, 6565.573237739532], "unit": "score", "name": "mootools.html", "value": 4331.116310784013}, {"lowerIsBetter": false, "replicates": [303.91490382692854, 304.84605274336457, 311.4565083928545, 315.30789916134086, 319.3262216722715, 6183.474404675602, 6212.161358216639, 6365.713542890569, 6411.903821442682, 6462.547621666486, 6253.781117660883, 6272.090546870701, 6289.748410063592, 6292.433680968712, 6316.147320111795, 4628.629709623239, 4724.834630787923, 4730.739809310487, 4732.881677958053, 4749.4063242094735, 4672.532746725335, 4704.97647511762, 4745.6440766942615, 4750.382450281459, 4765.42814862217, 4723.976380118094, 4734.0, 4739.834105806298, 4748.0978614063215, 4760.285957106427, 4732.881677958044, 4744.928826067595, 4759.048190361924, 4759.095771803381, 4767.90464190716, 4130.938035929464, 4154.31453810121, 4161.188568229197, 4161.2301724181125, 4162.583741625844, 5835.124731290298, 5898.672798620319, 5904.114382842565, 5929.873324068413, 5930.911036334458, 5286.762095705702, 5456.7544460499375, 5462.863428414282, 5474.39781624021, 5538.113901775737, 6607.768728094542, 6617.239017512999, 6629.966850165718, 6635.369639884203, 6657.434118099967, 4475.70907890986, 4477.5746304101385, 4489.438820147481, 4492.460904691458, 4495.797689103965, 6881.449484041264, 6914.51598388108, 6952.513324067318, 6968.79093627192, 6976.127984002, 4713.128071306819, 4716.693414928087, 4719.551642593948, 4734.337192793012, 4736.668433209711, 4617.0, 4696.81212751493, 4699.78850951708, 4702.224133018014, 4779.880502987453, 5409.43200963901, 5435.592330575223, 5486.0, 5510.366307874646, 5519.089350257243, 6619.602823830585, 6686.09737685416, 6696.933030669728, 6698.095757072831, 6704.061431399608, 1659.9253033613516, 1691.4756425508133, 1691.577105723569, 1699.5666105143357, 1700.3623641134575, 1081.7511972246427, 1089.5587287148717, 1112.3770688414513, 1123.118352093619, 1140.8516892804048, 6375.776847810304, 6387.712552935129, 6397.264314603787, 6415.647139407284, 6425.646589437626, 6777.423918966844, 6820.0, 6822.829429264308, 6838.452923766087, 6848.657567121624, 6252.437280644764, 6335.809925702236, 6359.523035772336, 6365.61806291624, 6393.392627700361, 3668.724845636588, 3740.6633402993316, 3753.6809371203753, 3754.0614846288427, 3773.2830762155104, 7362.8527429451115, 7376.631168441557, 7379.594122323324, 7415.369693575999, 7419.480636355512, 7059.435245180373, 7066.081409416845, 7071.611061391673, 7114.430845532345, 7126.750563730245, 7207.351338379571, 7383.963080184565, 7405.0, 7412.481126321213, 7461.888071678821, 6885.552439091443, 6916.619585922621, 6952.235254121942, 6954.756583519553, 6970.337817907291, 6847.0, 6855.280195579392, 6872.793816185523, 6908.723651054102, 6915.03189553473, 7356.668949897375, 7423.665935033045, 7432.3310902019075, 7435.03344565203, 7438.070241219848, 4454.5990860822685, 4482.574155455227, 4507.09858028389, 4538.546145385435, 4543.954560454353, 6900.551464154814, 6930.653467326512, 6936.583804971718, 6943.47923905699, 6950.756723514855, 6606.207255129415, 6689.565178263398, 6700.49746269022, 6701.1623547056615, 6704.564203326768, 6586.70359833799, 6642.667866606554, 6700.0, 6705.865882682417, 6712.093867327848, 6414.839629009125, 6502.219733631994, 6522.673866306571, 6559.311272316338, 6585.045168450452, 6633.70148343316, 6638.468922486093, 6644.10304608891, 6645.401913827779, 6672.799816005528, 6574.356410897276, 6574.4740420765265, 6577.572457790228, 6581.967090164519, 6584.176977877765], "unit": "score", "name": "prototype.html", "value": 5000.761530758046}, {"lowerIsBetter": false, "replicates": [768.9461737678362, 800.3317230112856, 830.4021104804539, 833.0752864320604, 847.7244895408994, 15698.293576789043, 15910.443134490295, 15954.760678589815, 15964.600884977866, 15970.76043859343, 14525.78211326831, 15057.774133388008, 15084.32120554575, 15093.471728489505, 15284.923575382107, 802.9718959836378, 809.1544336168718, 809.6316176139842, 810.1655295046082, 812.585581353511, 809.6518497046268, 816.4162623724036, 817.5176645778989, 818.6316157729016, 824.3034635732796, 848.3340577646518, 854.5129276312505, 859.4843094143527, 860.4364141487335, 860.6815478273048, 842.6755699055847, 845.8519759042143, 848.5926755157498, 851.1743608699583, 853.0871966995318, 624.5940138909699, 631.649434563817, 635.9745610175587, 637.3881074168803, 637.7066549387288, 13760.31198440084, 13774.380152893144, 13793.310334483336, 13813.309334533233, 13867.722645547032, 12526.0, 12784.296863672495, 12809.423575939105, 12827.166234194747, 12995.545155919592, 10995.780084398268, 11002.174836887185, 11021.559137634486, 11217.775644487147, 11613.535458581646, 3572.231970126409, 3602.981985090084, 3635.600083990759, 3691.907702307437, 3854.3447613905705, 52003.219951700376, 52137.2179417309, 52489.2126618101, 53012.20481692778, 53461.73269133629, 10138.083924009072, 10153.0, 10279.74300642475, 10355.792884142274, 10370.118539924191, 18700.625987480173, 18739.812601873808, 18756.906215468836, 18802.0, 18818.717719234224, 7425.368843648351, 7481.8877716834295, 7687.500312479783, 7699.422543309274, 7737.922620773833, 4031.536373317106, 4107.240160570304, 4118.485189351331, 4126.628603425706, 4201.411802347674, 3000.159955212544, 3039.6200474940633, 3060.4032213718556, 3060.648025477054, 3067.8772849085785, 534.1853673148402, 545.9235707001023, 549.5905550365004, 551.0439387662402, 554.7170942819191, 548.0682839173421, 555.7888002559001, 591.6745789815584, 620.4151321732401, 634.8285962790113, 8282.875756863652, 8383.0, 8439.789005274917, 8634.093420190915, 8702.34732395073, 583.6293953339575, 586.3989410853909, 596.8716725903952, 604.4892066204051, 713.5575942915322, 3961.3067713150085, 3990.3615421532418, 4027.838886444568, 4058.512978442606, 4071.1043570414463, 56463.15305270424, 58020.0, 58102.12846807301, 58245.41754582485, 58302.7084864573, 52115.0, 52515.0, 52517.7374113127, 53014.46985530172, 54049.72975135099, 49085.50914490881, 49091.263631045564, 49174.754126229855, 49448.25827612589, 49819.25271120936, 7716.266954639525, 7740.806479838049, 7913.9604301978125, 7915.0, 7921.722739704082, 33273.66726332706, 33306.500402494465, 33382.49926251157, 33641.327173456884, 34104.48843267403, 39695.20609587734, 39759.0, 42362.57637423586, 42454.15091698087, 42742.0, 10342.37945723259, 10423.843642345522, 10636.30863993838, 10741.033307002408, 11241.269317494336, 11809.940950295537, 11914.940425297818, 12357.38213089324, 12758.872411275768, 12963.935180324039, 11047.72380690489, 11111.555537778399, 11156.10751139923, 11428.428578571204, 11767.76464470723, 10830.945845270724, 11179.832302515631, 11197.552097915992, 11378.715532111764, 11602.18784685064, 10864.674059778219, 11059.281146725438, 11084.16868734832, 11245.662630121109, 11725.151716808561, 9811.656592019244, 10118.342307749972, 10204.591816327264, 10282.331648442827, 10322.948385258025, 8718.215360617574, 8988.820223595621, 9214.447133171763, 9536.284778641491, 9598.376105553116], "unit": "score", "name": "yui.html", "value": 6355.614226318238}], "name": "dromaeo_css", "value": 6887.844988882834}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 110.0, 112.0, 113.0, 114.0, 125.0, 113.0, 111.0, 112.0, 112.0], "unit": "score", "name": "ai-astar", "value": 113.4}, {"lowerIsBetter": true, "replicates": [159.0, 129.0, 151.0, 164.0, 138.0, 160.0, 150.0, 142.0, 174.0, 126.0], "unit": "score", "name": "audio-beat-detection", "value": 149.3}, {"lowerIsBetter": true, "replicates": [161.0, 163.0, 160.0, 162.0, 164.0, 162.0, 164.0, 166.0, 167.0, 162.0], "unit": "score", "name": "audio-dft", "value": 163.1}, {"lowerIsBetter": true, "replicates": [74.0, 75.0, 72.0, 73.0, 72.0, 74.0, 73.0, 140.0, 73.0, 77.0], "unit": "score", "name": "audio-fft", "value": 80.3}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 150.0, 95.0, 96.0, 95.0, 153.0, 95.0, 96.0, 142.0], "unit": "score", "name": "audio-oscillator", "value": 111.4}, {"lowerIsBetter": true, "replicates": [119.0, 116.0, 115.0, 115.0, 116.0, 115.0, 115.0, 115.0, 115.0, 116.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 115.7}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 147.0, 146.0, 147.0, 147.0, 146.0, 147.0, 147.0, 149.0], "unit": "score", "name": "imaging-darkroom", "value": 147.0}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 96.0, 97.0, 96.0, 96.0, 97.0, 96.0, 97.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.5}, {"lowerIsBetter": true, "replicates": [59.0, 56.0, 58.0, 56.0, 58.0, 56.0, 57.0, 58.0, 58.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 57.1}, {"lowerIsBetter": true, "replicates": [70.0, 68.0, 68.0, 68.0, 69.0, 67.0, 67.0, 68.0, 68.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 68.1}, {"lowerIsBetter": true, "replicates": [84.0, 85.0, 84.0, 86.0, 85.0, 83.0, 83.0, 84.0, 85.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 84.3}, {"lowerIsBetter": true, "replicates": [119.0, 119.0, 118.0, 118.0, 122.0, 122.0, 144.0, 128.0, 120.0, 117.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 122.7}, {"lowerIsBetter": true, "replicates": [146.0, 156.0, 151.0, 152.0, 154.0, 151.0, 152.0, 153.0, 156.0, 139.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 151.0}, {"lowerIsBetter": true, "replicates": [69.0, 73.0, 72.0, 69.0, 73.0, 71.0, 70.0, 71.0, 68.0, 67.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 70.3}], "name": "kraken", "value": 1530.2}]} 07:20:01 INFO - TinderboxPrint: TalosResult: {"graphserver": {"kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,1,43]]", "result": "1530.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,1,43]]", "result": "6887.84"}}} 07:20:01 INFO - Return code: 0 07:20:01 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 07:20:01 ERROR - # TBPL SUCCESS # 07:20:01 INFO - Running post-action listener: _resource_record_post_action 07:20:01 INFO - Running post-run listener: _resource_record_post_run 07:20:02 INFO - Total resource usage - Wall time: 1189s; CPU: 13.0%; Read bytes: 20480; Write bytes: 535998464; Read time: 256; Write time: 560956 07:20:02 INFO - install - Wall time: 17s; CPU: 15.0%; Read bytes: 0; Write bytes: 240844800; Read time: 0; Write time: 323120 07:20:02 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 20480; Write bytes: 295153664; Read time: 256; Write time: 237836 07:20:02 INFO - Running post-run listener: _upload_blobber_files 07:20:02 INFO - Blob upload gear active. 07:20:02 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 07:20:02 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 07:20:02 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', 'Firefox', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 07:20:02 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 Firefox -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 07:20:03 INFO - (blobuploader) - INFO - Open directory for files ... 07:20:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:20:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:20:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:20:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:20:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:20:04 INFO - (blobuploader) - INFO - Done attempting. 07:20:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:20:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:20:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:20:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:20:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:20:04 INFO - (blobuploader) - INFO - Done attempting. 07:20:04 INFO - (blobuploader) - INFO - Iteration through files over. 07:20:04 INFO - Return code: 0 07:20:04 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 07:20:04 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 07:20:04 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3fa827c18a58fdb0eb4e3b9b319b534bcddde54e6dacdc918ba290794ff17b1e44e47b516bd85e3cea03d5ca4e11a122860b7067a334526e75a8d6d7d2bb6de", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2df84463b3534f662b24bcb779a8dbdd5b23cc5c679075feaaf78eb88854ad6548a2d5ca4490fccb6fd51e8a6f8580effadea9be22bc18ecdceeabce22b6282e"} 07:20:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 07:20:04 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 07:20:04 INFO - Contents: 07:20:04 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3fa827c18a58fdb0eb4e3b9b319b534bcddde54e6dacdc918ba290794ff17b1e44e47b516bd85e3cea03d5ca4e11a122860b7067a334526e75a8d6d7d2bb6de", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2df84463b3534f662b24bcb779a8dbdd5b23cc5c679075feaaf78eb88854ad6548a2d5ca4490fccb6fd51e8a6f8580effadea9be22bc18ecdceeabce22b6282e"} 07:20:04 INFO - Running post-run listener: copy_logs_to_upload_dir 07:20:04 INFO - Copying logs to upload dir... 07:20:04 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 07:20:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1234.763703 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 34 secs) (at 2016-02-29 07:20:04.378166) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-29 07:20:04.381648) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3fa827c18a58fdb0eb4e3b9b319b534bcddde54e6dacdc918ba290794ff17b1e44e47b516bd85e3cea03d5ca4e11a122860b7067a334526e75a8d6d7d2bb6de", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2df84463b3534f662b24bcb779a8dbdd5b23cc5c679075feaaf78eb88854ad6548a2d5ca4490fccb6fd51e8a6f8580effadea9be22bc18ecdceeabce22b6282e"} build_url:https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011286 build_url: 'https://queue.taskcluster.net/v1/task/b2-OrJOVRfuMz4eg3-g9bQ/artifacts/public/build/firefox-47.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f3fa827c18a58fdb0eb4e3b9b319b534bcddde54e6dacdc918ba290794ff17b1e44e47b516bd85e3cea03d5ca4e11a122860b7067a334526e75a8d6d7d2bb6de", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2df84463b3534f662b24bcb779a8dbdd5b23cc5c679075feaaf78eb88854ad6548a2d5ca4490fccb6fd51e8a6f8580effadea9be22bc18ecdceeabce22b6282e"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-29 07:20:04.410260) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 07:20:04.410912) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1456756140.80738-1695647780 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004679 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-29 07:20:04.493126) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-29 07:20:04.493448) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-29 07:20:04.493737) ========= ========= Total master_lag: 0.29 =========