builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-054 starttime: 1456489316.11 results: success (0) buildid: 20160226015726 builduid: 6717eb82869240a49aa8c9ae2512e004 revision: 07594dabc7578c95c1fc632c23af24fe7e1f84ad ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.108385) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.108839) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.109167) ========= 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=cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.009186 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.05 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.171754) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.172181) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.300307) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.300606) ========= 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=cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004600 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.358821) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.359135) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.359529) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.359903) ========= 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=cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-02-26 04:21:57-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 43.5M=0s 2016-02-26 04:21:57 (43.5 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.176073 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.550844) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.551208) ========= 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=cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021023 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.602840) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:56.603270) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 07594dabc7578c95c1fc632c23af24fe7e1f84ad --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 07594dabc7578c95c1fc632c23af24fe7e1f84ad --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=cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-02-26 04:21:57,580 truncating revision to first 12 chars 2016-02-26 04:21:57,580 Setting DEBUG logging. 2016-02-26 04:21:57,580 attempt 1/10 2016-02-26 04:21:57,580 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/07594dabc757?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-02-26 04:21:57,853 unpacking tar archive at: mozilla-aurora-07594dabc757/testing/mozharness/ program finished with exit code 0 elapsedTime=0.566381 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:57.185212) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:57.185606) ========= echo 07594dabc7578c95c1fc632c23af24fe7e1f84ad in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'07594dabc7578c95c1fc632c23af24fe7e1f84ad'] 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=cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07594dabc7578c95c1fc632c23af24fe7e1f84ad program finished with exit code 0 elapsedTime=0.004668 script_repo_revision: '07594dabc7578c95c1fc632c23af24fe7e1f84ad' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:57.238970) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:57.239358) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-02-26 04:21:57.260175) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 29 secs) (at 2016-02-26 04:21:57.260483) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test-pgo/buildprops.json PWD=/builds/slave/test-pgo SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:21:58 INFO - MultiFileLogger online at 20160226 04:21:58 in /builds/slave/test-pgo 04:21:58 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 04:21:58 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 04:21:58 INFO - {'append_to_log': False, 04:21:58 INFO - 'base_work_dir': '/builds/slave/test-pgo', 04:21:58 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 04:21:58 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 04:21:58 INFO - 'branch': 'Mozilla-Aurora', 04:21:58 INFO - 'buildbot_json_path': 'buildprops.json', 04:21:58 INFO - 'config_files': ('talos/linux_config.py',), 04:21:58 INFO - 'default_actions': ('clobber', 04:21:58 INFO - 'read-buildbot-config', 04:21:58 INFO - 'download-and-extract', 04:21:58 INFO - 'populate-webroot', 04:21:58 INFO - 'create-virtualenv', 04:21:58 INFO - 'install', 04:21:58 INFO - 'run-tests'), 04:21:58 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:21:58 INFO - 'download_minidump_stackwalk': True, 04:21:58 INFO - 'download_symbols': 'ondemand', 04:21:58 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:21:58 INFO - 'tooltool.py': '/tools/tooltool.py', 04:21:58 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:21:58 INFO - '/tools/misc-python/virtualenv.py')}, 04:21:58 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:21:58 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:21:58 INFO - 'installer_path': 'installer.exe', 04:21:58 INFO - 'log_level': 'info', 04:21:58 INFO - 'log_name': 'talos', 04:21:58 INFO - 'log_to_console': True, 04:21:58 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:21:58 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:21:58 INFO - 'opt_config_files': (), 04:21:58 INFO - 'pip_index': False, 04:21:58 INFO - 'sps_profile': False, 04:21:58 INFO - 'sps_profile_interval': 0, 04:21:58 INFO - 'suite': 'dromaeojs-e10s', 04:21:58 INFO - 'system_bits': '32', 04:21:58 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:21:58 INFO - 'title': 'talos-linux64-ix-054', 04:21:58 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:21:58 INFO - 'use_talos_json': True, 04:21:58 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 04:21:58 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:21:58 INFO - 'work_dir': 'build'} 04:21:58 INFO - ##### 04:21:58 INFO - ##### Running clobber step. 04:21:58 INFO - ##### 04:21:58 INFO - Running pre-action listener: _resource_record_pre_action 04:21:58 INFO - Running main action method: clobber 04:21:58 INFO - rmtree: /builds/slave/test-pgo/build 04:21:58 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 04:21:58 INFO - Running post-action listener: _resource_record_post_action 04:21:58 INFO - ##### 04:21:58 INFO - ##### Running read-buildbot-config step. 04:21:58 INFO - ##### 04:21:58 INFO - Running pre-action listener: _resource_record_pre_action 04:21:58 INFO - Running main action method: read_buildbot_config 04:21:58 INFO - Using buildbot properties: 04:21:58 INFO - { 04:21:58 INFO - "project": "", 04:21:58 INFO - "product": "firefox", 04:21:58 INFO - "script_repo_revision": "production", 04:21:58 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 04:21:58 INFO - "repository": "", 04:21:58 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 04:21:58 INFO - "buildid": "20160226015726", 04:21:58 INFO - "pgo_build": "True", 04:21:58 INFO - "basedir": "/builds/slave/test-pgo", 04:21:58 INFO - "buildnumber": 168, 04:21:58 INFO - "slavename": "talos-linux64-ix-054", 04:21:58 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 04:21:58 INFO - "platform": "ubuntu64_hw", 04:21:58 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 04:21:58 INFO - "branch": "mozilla-aurora", 04:21:58 INFO - "repo_path": "releases/mozilla-aurora", 04:21:58 INFO - "revision": "07594dabc7578c95c1fc632c23af24fe7e1f84ad", 04:21:58 INFO - "stage_platform": "linux64-pgo", 04:21:58 INFO - "builduid": "6717eb82869240a49aa8c9ae2512e004", 04:21:58 INFO - "slavebuilddir": "test" 04:21:58 INFO - } 04:21:58 INFO - Found installer url https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2. 04:21:58 INFO - Running post-action listener: _resource_record_post_action 04:21:58 INFO - ##### 04:21:58 INFO - ##### Running download-and-extract step. 04:21:58 INFO - ##### 04:21:58 INFO - Running pre-action listener: _resource_record_pre_action 04:21:58 INFO - Running main action method: download_and_extract 04:21:58 INFO - mkdir: /builds/slave/test-pgo/build/tests 04:21:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:21:58 INFO - https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 04:21:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/test_packages.json 04:21:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/test_packages.json 04:21:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 04:21:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 04:21:59 INFO - Downloaded 1448 bytes. 04:21:59 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 04:21:59 INFO - Using the following test package requirements: 04:21:59 INFO - {u'common': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 04:21:59 INFO - u'cppunittest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-46.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 04:21:59 INFO - u'gtest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-46.0a2.en-US.linux-x86_64.gtest.tests.zip'], 04:21:59 INFO - u'jittest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'jsshell-linux-x86_64.zip'], 04:21:59 INFO - u'mochitest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-46.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 04:21:59 INFO - u'mozbase': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 04:21:59 INFO - u'reftest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-46.0a2.en-US.linux-x86_64.reftest.tests.zip'], 04:21:59 INFO - u'talos': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip'], 04:21:59 INFO - u'web-platform': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-46.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 04:21:59 INFO - u'webapprt': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 04:21:59 INFO - u'xpcshell': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 04:21:59 INFO - u'firefox-46.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 04:21:59 INFO - Downloading packages: [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:21: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')]} 04:21:59 INFO - https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:21:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 04:21:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 04:21:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 04:21:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:22:01 INFO - Downloaded 23081921 bytes. 04:22:01 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 04:22:01 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 04:22:02 INFO - Return code: 0 04:22:02 INFO - Downloading packages: [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 04:22:02 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')]} 04:22:02 INFO - https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 04:22:02 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 04:22:02 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 04:22:02 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 04:22:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:22:21 INFO - Downloaded 23081921 bytes. 04:22:21 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 04:22:21 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 04:22:22 INFO - Return code: 0 04:22:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:22 INFO - https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 04:22:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 04:22:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 04:22:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 04:22:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:22:24 INFO - Downloaded 10706649 bytes. 04:22:24 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 04:22:24 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 04:22:25 INFO - Return code: 0 04:22:25 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')]} 04:22:25 INFO - https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 04:22:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 04:22:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 04:22:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 04:22:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 04:22:33 INFO - Downloaded 59960157 bytes. 04:22:33 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 04:22:33 INFO - mkdir: /builds/slave/test-pgo/properties 04:22:33 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 04:22:33 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 04:22:33 INFO - Contents: 04:22:33 INFO - build_url:https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 04:22:33 INFO - Running post-action listener: _resource_record_post_action 04:22:33 INFO - Running post-action listener: set_extra_try_arguments 04:22:33 INFO - ##### 04:22:33 INFO - ##### Running populate-webroot step. 04:22:33 INFO - ##### 04:22:33 INFO - Running pre-action listener: _resource_record_pre_action 04:22:33 INFO - Running main action method: populate_webroot 04:22:33 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:22:33 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:22:33 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:22:33 INFO - '--tppagecycles', 04:22:33 INFO - '7'], 04:22:33 INFO - 'tests': ['tsvgm']}}, 04:22:33 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 04:22:33 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 04:22:33 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:22:33 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:22:33 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 04:22:33 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 04:22:33 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:22:33 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:33 INFO - 'talos_options': ['--e10s'], 04:22:33 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:22:33 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:33 INFO - 'tests': ['damp', 'tps']}, 04:22:33 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:33 INFO - 'talos_options': ['--e10s'], 04:22:33 INFO - 'tests': ['damp', 'tps']}, 04:22:33 INFO - 'g3': {'tests': ['dromaeo_dom']}, 04:22:33 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:22:33 INFO - 'other': {'tests': ['a11yr', 04:22:33 INFO - 'ts_paint', 04:22:33 INFO - 'tpaint', 04:22:33 INFO - 'sessionrestore', 04:22:33 INFO - 'sessionrestore_no_auto_restore']}, 04:22:33 INFO - 'other-e10s': {'talos_options': ['--e10s'], 04:22:33 INFO - 'tests': ['a11yr', 04:22:33 INFO - 'ts_paint', 04:22:33 INFO - 'tpaint', 04:22:33 INFO - 'sessionrestore', 04:22:33 INFO - 'sessionrestore_no_auto_restore']}, 04:22:33 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 04:22:33 INFO - 'tests': ['a11yr', 04:22:33 INFO - 'ts_paint', 04:22:33 INFO - 'tpaint', 04:22:33 INFO - 'sessionrestore', 04:22:33 INFO - 'sessionrestore_no_auto_restore']}, 04:22:33 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 04:22:33 INFO - 'tests': ['a11yr', 04:22:33 INFO - 'ts_paint', 04:22:33 INFO - 'tpaint', 04:22:33 INFO - 'sessionrestore', 04:22:33 INFO - 'sessionrestore_no_auto_restore']}, 04:22:33 INFO - 'other_l64': {'tests': ['a11yr', 04:22:33 INFO - 'ts_paint', 04:22:33 INFO - 'tpaint', 04:22:33 INFO - 'sessionrestore', 04:22:33 INFO - 'sessionrestore_no_auto_restore']}, 04:22:33 INFO - 'other_nol64': {'tests': ['a11yr', 04:22:33 INFO - 'ts_paint', 04:22:33 INFO - 'tpaint', 04:22:33 INFO - 'sessionrestore', 04:22:33 INFO - 'sessionrestore_no_auto_restore']}, 04:22:33 INFO - 'svgr': {'tests': ['tsvgx', 04:22:33 INFO - 'tsvgr_opacity', 04:22:33 INFO - 'tart', 04:22:33 INFO - 'tscrollx', 04:22:33 INFO - 'cart']}, 04:22:33 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 04:22:33 INFO - 'tests': ['tsvgx', 04:22:33 INFO - 'tsvgr_opacity', 04:22:33 INFO - 'tart', 04:22:33 INFO - 'tscrollx', 04:22:33 INFO - 'cart']}, 04:22:33 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:33 INFO - 'tests': ['tp5o']}, 04:22:33 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:33 INFO - 'talos_options': ['--e10s'], 04:22:33 INFO - 'tests': ['tp5o']}, 04:22:33 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:33 INFO - 'talos_options': ['--xperf_path', 04:22:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:22:33 INFO - 'tests': ['tp5n']}, 04:22:33 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:22:33 INFO - 'talos_options': ['--e10s', 04:22:33 INFO - '--xperf_path', 04:22:33 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:22:33 INFO - 'tests': ['tp5n']}}, 04:22:33 INFO - 'talos.zip': {'path': '', 04:22:33 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:22:33 INFO - Running post-action listener: _resource_record_post_action 04:22:33 INFO - ##### 04:22:33 INFO - ##### Running create-virtualenv step. 04:22:33 INFO - ##### 04:22:33 INFO - Running pre-action listener: _resource_record_pre_action 04:22:33 INFO - Running main action method: create_virtualenv 04:22:33 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 04:22:33 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 04:22:33 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 04:22:34 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:22:34 INFO - Using real prefix '/usr' 04:22:34 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 04:22:34 INFO - Installing distribute.............................................................................................................................................................................................done. 04:22:36 INFO - Installing pip.................done. 04:22:36 INFO - Return code: 0 04:22:36 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 04:22: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')]} 04:22:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22: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')]} 04:22:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:36 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 0x7f82212b4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e51480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, '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': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', '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 04:22:36 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 04:22:36 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 04:22:36 INFO - Using env: {'DISPLAY': ':0', 04:22:36 INFO - 'HOME': '/home/cltbld', 04:22:36 INFO - 'LANG': 'en_US.UTF-8', 04:22:36 INFO - 'LANGUAGE': 'en_US:en', 04:22:36 INFO - 'LOGNAME': 'cltbld', 04:22:36 INFO - 'MAIL': '/var/mail/cltbld', 04:22:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:36 INFO - 'MOZ_NO_REMOTE': '1', 04:22:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:36 INFO - 'NO_EM_RESTART': '1', 04:22:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:22:36 INFO - 'PWD': '/builds/slave/test-pgo', 04:22:36 INFO - 'SHELL': '/bin/bash', 04:22:36 INFO - 'SHLVL': '1', 04:22:36 INFO - 'TERM': 'linux', 04:22:36 INFO - 'TMOUT': '86400', 04:22:36 INFO - 'USER': 'cltbld', 04:22:36 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:22:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:36 INFO - '_': '/tools/buildbot/bin/python'} 04:22:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:36 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 04:22:36 INFO - Cleaning up... 04:22:36 INFO - Return code: 0 04:22:36 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 04:22: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')]} 04:22:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22: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')]} 04:22:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:36 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 0x7f82212b4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e51480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, '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': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', '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 04:22:36 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 04:22:36 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 04:22:36 INFO - Using env: {'DISPLAY': ':0', 04:22:36 INFO - 'HOME': '/home/cltbld', 04:22:36 INFO - 'LANG': 'en_US.UTF-8', 04:22:36 INFO - 'LANGUAGE': 'en_US:en', 04:22:36 INFO - 'LOGNAME': 'cltbld', 04:22:36 INFO - 'MAIL': '/var/mail/cltbld', 04:22:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:36 INFO - 'MOZ_NO_REMOTE': '1', 04:22:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:36 INFO - 'NO_EM_RESTART': '1', 04:22:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:22:36 INFO - 'PWD': '/builds/slave/test-pgo', 04:22:36 INFO - 'SHELL': '/bin/bash', 04:22:36 INFO - 'SHLVL': '1', 04:22:36 INFO - 'TERM': 'linux', 04:22:36 INFO - 'TMOUT': '86400', 04:22:36 INFO - 'USER': 'cltbld', 04:22:36 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:22:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:36 INFO - '_': '/tools/buildbot/bin/python'} 04:22:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:36 INFO - Downloading/unpacking psutil>=0.7.1 04:22:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:39 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 04:22:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:22:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:22:39 INFO - Installing collected packages: psutil 04:22:39 INFO - Running setup.py install for psutil 04:22:39 INFO - building 'psutil._psutil_linux' extension 04:22:39 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 04:22:39 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 04:22:39 INFO - building 'psutil._psutil_posix' extension 04:22:39 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 04:22:39 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 04:22:39 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:22:39 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:22:39 INFO - Successfully installed psutil 04:22:39 INFO - Cleaning up... 04:22:39 INFO - Return code: 0 04:22:39 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 04:22:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:39 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 0x7f82212b4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e51480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, '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': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', '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 04:22:39 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 04:22:39 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 04:22:39 INFO - Using env: {'DISPLAY': ':0', 04:22:39 INFO - 'HOME': '/home/cltbld', 04:22:39 INFO - 'LANG': 'en_US.UTF-8', 04:22:39 INFO - 'LANGUAGE': 'en_US:en', 04:22:39 INFO - 'LOGNAME': 'cltbld', 04:22:39 INFO - 'MAIL': '/var/mail/cltbld', 04:22:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:39 INFO - 'MOZ_NO_REMOTE': '1', 04:22:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:39 INFO - 'NO_EM_RESTART': '1', 04:22:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:22:39 INFO - 'PWD': '/builds/slave/test-pgo', 04:22:39 INFO - 'SHELL': '/bin/bash', 04:22:39 INFO - 'SHLVL': '1', 04:22:39 INFO - 'TERM': 'linux', 04:22:39 INFO - 'TMOUT': '86400', 04:22:39 INFO - 'USER': 'cltbld', 04:22:39 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:22:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:39 INFO - '_': '/tools/buildbot/bin/python'} 04:22:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:39 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 04:22:39 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 04:22:39 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 04:22:39 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 04:22:39 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 04:22:39 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 04:22:39 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 04:22:41 INFO - Downloading mozsystemmonitor-0.0.tar.gz 04:22:41 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:22:41 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 04:22:41 INFO - Installing collected packages: mozsystemmonitor 04:22:41 INFO - Running setup.py install for mozsystemmonitor 04:22:41 INFO - Successfully installed mozsystemmonitor 04:22:41 INFO - Cleaning up... 04:22:41 INFO - Return code: 0 04:22:41 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 04:22:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:41 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 0x7f82212b4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e51480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, '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': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', '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 04:22:41 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 04:22:41 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 04:22:41 INFO - Using env: {'DISPLAY': ':0', 04:22:41 INFO - 'HOME': '/home/cltbld', 04:22:41 INFO - 'LANG': 'en_US.UTF-8', 04:22:41 INFO - 'LANGUAGE': 'en_US:en', 04:22:41 INFO - 'LOGNAME': 'cltbld', 04:22:41 INFO - 'MAIL': '/var/mail/cltbld', 04:22:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:41 INFO - 'MOZ_NO_REMOTE': '1', 04:22:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:41 INFO - 'NO_EM_RESTART': '1', 04:22:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:22:41 INFO - 'PWD': '/builds/slave/test-pgo', 04:22:41 INFO - 'SHELL': '/bin/bash', 04:22:41 INFO - 'SHLVL': '1', 04:22:41 INFO - 'TERM': 'linux', 04:22:41 INFO - 'TMOUT': '86400', 04:22:41 INFO - 'USER': 'cltbld', 04:22:41 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:22:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:41 INFO - '_': '/tools/buildbot/bin/python'} 04:22:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:42 INFO - Downloading/unpacking blobuploader==1.2.4 04:22:42 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 04:22:42 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 04:22:42 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 04:22:42 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 04:22:42 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 04:22:42 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 04:22:44 INFO - Downloading blobuploader-1.2.4.tar.gz 04:22:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:22:44 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:22:44 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 04:22:44 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 04:22:44 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 04:22:44 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 04:22:44 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 04:22:44 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 04:22:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 04:22:44 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:22:44 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 04:22:44 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 04:22:44 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 04:22:44 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 04:22:44 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 04:22:44 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 04:22:44 INFO - Downloading docopt-0.6.1.tar.gz 04:22:44 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 04:22:44 INFO - Installing collected packages: blobuploader, requests, docopt 04:22:44 INFO - Running setup.py install for blobuploader 04:22:44 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:22:44 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 04:22:44 INFO - Running setup.py install for requests 04:22:45 INFO - Running setup.py install for docopt 04:22:45 INFO - Successfully installed blobuploader requests docopt 04:22:45 INFO - Cleaning up... 04:22:45 INFO - Return code: 0 04:22:45 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 04:22:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:45 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 0x7f82212b4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e51480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, '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': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', '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 04:22:45 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 04:22:45 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 04:22:45 INFO - Using env: {'DISPLAY': ':0', 04:22:45 INFO - 'HOME': '/home/cltbld', 04:22:45 INFO - 'LANG': 'en_US.UTF-8', 04:22:45 INFO - 'LANGUAGE': 'en_US:en', 04:22:45 INFO - 'LOGNAME': 'cltbld', 04:22:45 INFO - 'MAIL': '/var/mail/cltbld', 04:22:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:45 INFO - 'MOZ_NO_REMOTE': '1', 04:22:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:45 INFO - 'NO_EM_RESTART': '1', 04:22:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:22:45 INFO - 'PWD': '/builds/slave/test-pgo', 04:22:45 INFO - 'SHELL': '/bin/bash', 04:22:45 INFO - 'SHLVL': '1', 04:22:45 INFO - 'TERM': 'linux', 04:22:45 INFO - 'TMOUT': '86400', 04:22:45 INFO - 'USER': 'cltbld', 04:22:45 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:22:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:45 INFO - '_': '/tools/buildbot/bin/python'} 04:22:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 04:22:45 INFO - Running setup.py (path:/tmp/pip-5Vb2cM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 04:22:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 04:22:45 INFO - Running setup.py (path:/tmp/pip-ScK6X6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 04:22:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 04:22:45 INFO - Running setup.py (path:/tmp/pip-4xP3KZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 04:22:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 04:22:45 INFO - Running setup.py (path:/tmp/pip-XFXqWD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 04:22:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 04:22:45 INFO - Running setup.py (path:/tmp/pip-hOvhi8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 04:22:45 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 04:22:45 INFO - Running setup.py (path:/tmp/pip-BRWeSu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 04:22:46 INFO - Running setup.py (path:/tmp/pip-5vryrQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 04:22:46 INFO - Running setup.py (path:/tmp/pip-H79E3r-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 04:22:46 INFO - Running setup.py (path:/tmp/pip-A2luJ2-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 04:22:46 INFO - Running setup.py (path:/tmp/pip-SExfcA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 04:22:46 INFO - Running setup.py (path:/tmp/pip-Q7gCuL-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 04:22:46 INFO - Running setup.py (path:/tmp/pip-Lqnyeu-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 04:22:46 INFO - Running setup.py (path:/tmp/pip-4w4jyh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 04:22:46 INFO - Running setup.py (path:/tmp/pip-bz5P1F-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 04:22:46 INFO - Running setup.py (path:/tmp/pip-WMVIOT-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 04:22:46 INFO - Running setup.py (path:/tmp/pip-OZ_w2m-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 04:22:46 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 04:22:46 INFO - Running setup.py (path:/tmp/pip-eo_Qo9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 04:22:46 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:22:46 INFO - Running setup.py install for manifestparser 04:22:46 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 04:22:46 INFO - Running setup.py install for mozcrash 04:22:47 INFO - Running setup.py install for mozdebug 04:22:47 INFO - Running setup.py install for mozdevice 04:22:47 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Running setup.py install for mozfile 04:22:47 INFO - Running setup.py install for mozhttpd 04:22:47 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Running setup.py install for mozinfo 04:22:47 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Running setup.py install for mozInstall 04:22:47 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Running setup.py install for mozleak 04:22:47 INFO - Running setup.py install for mozlog 04:22:47 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Running setup.py install for moznetwork 04:22:47 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 04:22:47 INFO - Running setup.py install for mozprocess 04:22:48 INFO - Running setup.py install for mozprofile 04:22:48 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 04:22:48 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 04:22:48 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 04:22:48 INFO - Running setup.py install for mozrunner 04:22:48 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 04:22:48 INFO - Running setup.py install for mozscreenshot 04:22:48 INFO - Running setup.py install for moztest 04:22:48 INFO - Running setup.py install for mozversion 04:22:48 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 04:22:48 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:22:48 INFO - Cleaning up... 04:22:48 INFO - Return code: 0 04:22:48 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 04:22:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:48 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test-pgo/build/tests/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 0x7f82212b4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e51480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, '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': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', '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 04:22:48 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 04:22:48 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 04:22:48 INFO - Using env: {'DISPLAY': ':0', 04:22:48 INFO - 'HOME': '/home/cltbld', 04:22:48 INFO - 'LANG': 'en_US.UTF-8', 04:22:48 INFO - 'LANGUAGE': 'en_US:en', 04:22:48 INFO - 'LOGNAME': 'cltbld', 04:22:48 INFO - 'MAIL': '/var/mail/cltbld', 04:22:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:48 INFO - 'MOZ_NO_REMOTE': '1', 04:22:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:48 INFO - 'NO_EM_RESTART': '1', 04:22:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:22:48 INFO - 'PWD': '/builds/slave/test-pgo', 04:22:48 INFO - 'SHELL': '/bin/bash', 04:22:48 INFO - 'SHLVL': '1', 04:22:48 INFO - 'TERM': 'linux', 04:22:48 INFO - 'TMOUT': '86400', 04:22:48 INFO - 'USER': 'cltbld', 04:22:48 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:22:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:48 INFO - '_': '/tools/buildbot/bin/python'} 04:22:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 04:22:48 INFO - Running setup.py (path:/tmp/pip-Q0tBKf-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 04:22:48 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)) 04:22:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 04:22:48 INFO - Running setup.py (path:/tmp/pip-kD_VnQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 04:22:48 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)) 04:22:48 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 04:22:48 INFO - Running setup.py (path:/tmp/pip-RUVgn7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 04:22:49 INFO - Running setup.py (path:/tmp/pip-kQGe3F-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 04:22:49 INFO - Running setup.py (path:/tmp/pip-h6xxl9-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 04:22:49 INFO - Running setup.py (path:/tmp/pip-yVzgoA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 04:22:49 INFO - Running setup.py (path:/tmp/pip-gEBCT1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 04:22:49 INFO - Running setup.py (path:/tmp/pip-YELBB1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 04:22:49 INFO - Running setup.py (path:/tmp/pip-JPpumz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 04:22:49 INFO - Running setup.py (path:/tmp/pip-8TcnZC-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 04:22:49 INFO - Running setup.py (path:/tmp/pip-urZMnR-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 04:22:49 INFO - Running setup.py (path:/tmp/pip-2hNVOB-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 04:22:49 INFO - Running setup.py (path:/tmp/pip-t6qDC0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 04:22:49 INFO - Running setup.py (path:/tmp/pip-bLUfRx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 04:22:49 INFO - Running setup.py (path:/tmp/pip-Zi81O7-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 04:22:49 INFO - Running setup.py (path:/tmp/pip-5YqIc8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 04:22:49 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)) 04:22:49 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 04:22:49 INFO - Running setup.py (path:/tmp/pip-BrqjHQ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 04:22:50 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)) 04:22:50 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)) 04:22:50 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)) 04:22:50 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)) 04:22:50 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)) 04:22:50 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)) 04:22:50 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 04:22:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:50 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:50 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:51 INFO - Downloading blessings-1.6.tar.gz 04:22:51 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 04:22:51 INFO - Installing collected packages: blessings 04:22:51 INFO - Running setup.py install for blessings 04:22:52 INFO - Successfully installed blessings 04:22:52 INFO - Cleaning up... 04:22:52 INFO - Return code: 0 04:22:52 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 04:22:52 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 04:22:52 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 04:22:52 INFO - Reading from file tmpfile_stdout 04:22:52 INFO - Current package versions: 04:22:52 INFO - argparse == 1.2.1 04:22:52 INFO - blessings == 1.6 04:22:52 INFO - blobuploader == 1.2.4 04:22:52 INFO - docopt == 0.6.1 04:22:52 INFO - manifestparser == 1.1 04:22:52 INFO - mozInstall == 1.12 04:22:52 INFO - mozcrash == 0.16 04:22:52 INFO - mozdebug == 0.1 04:22:52 INFO - mozdevice == 0.48 04:22:52 INFO - mozfile == 1.2 04:22:52 INFO - mozhttpd == 0.7 04:22:52 INFO - mozinfo == 0.9 04:22:52 INFO - mozleak == 0.1 04:22:52 INFO - mozlog == 3.1 04:22:52 INFO - moznetwork == 0.27 04:22:52 INFO - mozprocess == 0.22 04:22:52 INFO - mozprofile == 0.28 04:22:52 INFO - mozrunner == 6.11 04:22:52 INFO - mozscreenshot == 0.1 04:22:52 INFO - mozsystemmonitor == 0.0 04:22:52 INFO - moztest == 0.7 04:22:52 INFO - mozversion == 1.4 04:22:52 INFO - psutil == 3.1.1 04:22:52 INFO - requests == 1.2.3 04:22:52 INFO - wsgiref == 0.1.2 04:22:52 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 04:22:52 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')]} 04:22:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:52 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')]} 04:22:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:52 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 0x7f82212b4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e51480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, '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': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', '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 04:22:52 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 04:22:52 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 04:22:52 INFO - Using env: {'DISPLAY': ':0', 04:22:52 INFO - 'HOME': '/home/cltbld', 04:22:52 INFO - 'LANG': 'en_US.UTF-8', 04:22:52 INFO - 'LANGUAGE': 'en_US:en', 04:22:52 INFO - 'LOGNAME': 'cltbld', 04:22:52 INFO - 'MAIL': '/var/mail/cltbld', 04:22:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:52 INFO - 'MOZ_NO_REMOTE': '1', 04:22:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:52 INFO - 'NO_EM_RESTART': '1', 04:22:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:22:52 INFO - 'PWD': '/builds/slave/test-pgo', 04:22:52 INFO - 'SHELL': '/bin/bash', 04:22:52 INFO - 'SHLVL': '1', 04:22:52 INFO - 'TERM': 'linux', 04:22:52 INFO - 'TMOUT': '86400', 04:22:52 INFO - 'USER': 'cltbld', 04:22:52 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:22:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:52 INFO - '_': '/tools/buildbot/bin/python'} 04:22:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:53 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)) 04:22:53 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)) 04:22:53 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)) 04:22:53 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)) 04:22:53 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)) 04:22:53 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)) 04:22:53 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)) 04:22:53 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)) 04:22:53 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)) 04:22:53 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)) 04:22:53 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)) 04:22:53 INFO - Cleaning up... 04:22:53 INFO - Return code: 0 04:22:53 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 04:22:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:53 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f82212b4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e51480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, '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': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', '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 04:22:53 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test-pgo/build 04:22:53 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:22:53 INFO - Using env: {'DISPLAY': ':0', 04:22:53 INFO - 'HOME': '/home/cltbld', 04:22:53 INFO - 'LANG': 'en_US.UTF-8', 04:22:53 INFO - 'LANGUAGE': 'en_US:en', 04:22:53 INFO - 'LOGNAME': 'cltbld', 04:22:53 INFO - 'MAIL': '/var/mail/cltbld', 04:22:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:53 INFO - 'MOZ_NO_REMOTE': '1', 04:22:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:53 INFO - 'NO_EM_RESTART': '1', 04:22:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:22:53 INFO - 'PWD': '/builds/slave/test-pgo', 04:22:53 INFO - 'SHELL': '/bin/bash', 04:22:53 INFO - 'SHLVL': '1', 04:22:53 INFO - 'TERM': 'linux', 04:22:53 INFO - 'TMOUT': '86400', 04:22:53 INFO - 'USER': 'cltbld', 04:22:53 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:22:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:53 INFO - '_': '/tools/buildbot/bin/python'} 04:22:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:53 INFO - Downloading/unpacking jsonschema 04:22:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:53 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:53 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:53 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:53 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:55 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:22:55 INFO - Downloading/unpacking functools32 (from jsonschema) 04:22:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:55 INFO - Downloading functools32-3.2.3-2.tar.gz 04:22:55 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 04:22:55 INFO - warning: no files found matching '*.txt' 04:22:55 INFO - no previously-included directories found matching 'build' 04:22:55 INFO - no previously-included directories found matching 'dist' 04:22:55 INFO - no previously-included directories found matching '.git*' 04:22:55 INFO - Installing collected packages: jsonschema, functools32 04:22:55 INFO - Running setup.py install for functools32 04:22:55 INFO - warning: no files found matching '*.txt' 04:22:55 INFO - no previously-included directories found matching 'build' 04:22:55 INFO - no previously-included directories found matching 'dist' 04:22:55 INFO - no previously-included directories found matching '.git*' 04:22:55 INFO - Successfully installed jsonschema functools32 04:22:55 INFO - Cleaning up... 04:22:55 INFO - Return code: 0 04:22:55 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 04:22:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:22:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:22:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:22:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:22:55 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 0x7f82212b4f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1d848a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e51480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, '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': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', '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 04:22:55 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 04:22:55 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 04:22:55 INFO - Using env: {'DISPLAY': ':0', 04:22:55 INFO - 'HOME': '/home/cltbld', 04:22:55 INFO - 'LANG': 'en_US.UTF-8', 04:22:55 INFO - 'LANGUAGE': 'en_US:en', 04:22:55 INFO - 'LOGNAME': 'cltbld', 04:22:55 INFO - 'MAIL': '/var/mail/cltbld', 04:22:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:22:55 INFO - 'MOZ_NO_REMOTE': '1', 04:22:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:22:55 INFO - 'NO_EM_RESTART': '1', 04:22:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:22:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:22:55 INFO - 'PWD': '/builds/slave/test-pgo', 04:22:55 INFO - 'SHELL': '/bin/bash', 04:22:55 INFO - 'SHLVL': '1', 04:22:55 INFO - 'TERM': 'linux', 04:22:55 INFO - 'TMOUT': '86400', 04:22:55 INFO - 'USER': 'cltbld', 04:22:55 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:22:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:22:55 INFO - '_': '/tools/buildbot/bin/python'} 04:22:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:22:55 INFO - Downloading/unpacking flake8 04:22:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:57 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 04:22:57 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 04:22:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:57 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 04:22:57 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 04:22:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:57 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:57 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:22:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:22:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:22:58 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 04:22: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 04:22: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 04:22: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 04:22: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 04:22: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 04:22: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 04:22:58 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 04:22:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:22:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:22:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:22:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:22:58 INFO - no previously-included directories found matching 'docs/_build' 04:22:58 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 04:22:58 INFO - Running setup.py install for pep8 04:22:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 04:22:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 04:22:58 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 04:22:58 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 04:22:58 INFO - no previously-included directories found matching 'docs/_build' 04:22:58 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 04:22:58 INFO - Successfully installed flake8 mccabe pyflakes pep8 04:22:58 INFO - Cleaning up... 04:22:58 INFO - Return code: 0 04:22:58 INFO - Running post-action listener: _resource_record_post_action 04:22:58 INFO - Running post-action listener: _start_resource_monitoring 04:22:58 INFO - Starting resource monitoring. 04:22:58 INFO - ##### 04:22:58 INFO - ##### Running install step. 04:22:58 INFO - ##### 04:22:58 INFO - Running pre-action listener: _resource_record_pre_action 04:22:58 INFO - Running main action method: install 04:22:58 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 04:22:58 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 04:22:59 INFO - Reading from file tmpfile_stdout 04:22:59 INFO - Detecting whether we're running mozinstall >=1.0... 04:22:59 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 04:22:59 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 04:22:59 INFO - Reading from file tmpfile_stdout 04:22:59 INFO - Output received: 04:22:59 INFO - Usage: mozinstall [options] installer 04:22:59 INFO - Options: 04:22:59 INFO - -h, --help show this help message and exit 04:22:59 INFO - -d DEST, --destination=DEST 04:22:59 INFO - Directory to install application into. [default: 04:22:59 INFO - "/builds/slave/test-pgo"] 04:22:59 INFO - --app=APP Application being installed. [default: firefox] 04:22:59 INFO - mkdir: /builds/slave/test-pgo/build/application 04:22:59 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 04:22:59 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 04:23:14 INFO - Reading from file tmpfile_stdout 04:23:14 INFO - Output received: 04:23:14 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 04:23:14 INFO - Running post-action listener: _resource_record_post_action 04:23:14 INFO - ##### 04:23:14 INFO - ##### Running run-tests step. 04:23:14 INFO - ##### 04:23:14 INFO - Running pre-action listener: _resource_record_pre_action 04:23:14 INFO - Running main action method: run_tests 04:23:14 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 04:23:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 04:23:14 INFO - Python 2.7.3 04:23:14 INFO - Return code: 0 04:23:14 INFO - grabbing minidump binary from tooltool 04:23:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 04:23:14 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 0x1ee0660>, '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 0x1ee1560>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1ee1a10>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 04:23:14 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 04:23:14 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 04:23:14 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:23:14 INFO - Return code: 0 04:23:14 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 04:23:14 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 04:23:14 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 04:23:14 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 04:23:14 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 04:23:14 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 04:23:14 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 04:23:15 INFO - Return code: 0 04:23:15 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-054', '--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 04:23:15 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-054 --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 04:23:15 INFO - Using env: {'DISPLAY': ':0', 04:23:15 INFO - 'HOME': '/home/cltbld', 04:23:15 INFO - 'LANG': 'en_US.UTF-8', 04:23:15 INFO - 'LANGUAGE': 'en_US:en', 04:23:15 INFO - 'LOGNAME': 'cltbld', 04:23:15 INFO - 'MAIL': '/var/mail/cltbld', 04:23:15 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 04:23:15 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 04:23:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:23:15 INFO - 'MOZ_NO_REMOTE': '1', 04:23:15 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 04:23:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:23:15 INFO - 'NO_EM_RESTART': '1', 04:23:15 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:23:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 04:23:15 INFO - 'PWD': '/builds/slave/test-pgo', 04:23:15 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 04:23:15 INFO - 'SHELL': '/bin/bash', 04:23:15 INFO - 'SHLVL': '1', 04:23:15 INFO - 'TERM': 'linux', 04:23:15 INFO - 'TMOUT': '86400', 04:23:15 INFO - 'USER': 'cltbld', 04:23:15 INFO - 'XDG_SESSION_COOKIE': 'cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084', 04:23:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:23:15 INFO - '_': '/tools/buildbot/bin/python'} 04:23:15 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-054', '--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 04:23:15 INFO - mozversion application_buildid: 20160226015726 04:23:15 INFO - mozversion application_changeset: 07594dabc7578c95c1fc632c23af24fe7e1f84ad 04:23:15 INFO - mozversion application_display_name: FirefoxDeveloperEdition 04:23:15 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:23:15 INFO - mozversion application_name: Firefox 04:23:15 INFO - mozversion application_remotingname: firefox-dev 04:23:15 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 04:23:15 INFO - mozversion application_vendor: Mozilla 04:23:15 INFO - mozversion application_version: 46.0a2 04:23:15 INFO - mozversion platform_buildid: 20160226015726 04:23:15 INFO - mozversion platform_changeset: 07594dabc7578c95c1fc632c23af24fe7e1f84ad 04:23:15 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 04:23:15 INFO - mozversion platform_version: 46.0a2 04:23:15 INFO - using testdate: 1456489395 04:23:15 INFO - actual date: 1456489395 04:23:15 INFO - starting webserver on 'localhost:48320' 04:23:15 INFO - SUITE-START | Running 3 tests 04:23:15 INFO - TEST-START | dromaeo_css 04:23:15 INFO - operating with platform_type : linux_ 04:23:15 INFO - Initialising browser for dromaeo_css test... 04:23:15 INFO - TEST-INFO | started process 7570 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp9ANju1/profile http://localhost:48320/getInfo.html) 04:23:19 INFO - PROCESS | 7570 | 04:23:19 INFO - PROCESS | 7570 | (process:7650): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:23:20 INFO - PROCESS | 7570 | __metrics Screen width/height:1600/1200 04:23:20 INFO - PROCESS | 7570 | colorDepth:24 04:23:20 INFO - PROCESS | 7570 | Browser inner width/height: 1024/697 04:23:20 INFO - PROCESS | 7570 | __metrics 04:23:21 INFO - TEST-INFO | 7570: exit 0 04:23:21 INFO - Browser initialized. 04:23:21 INFO - Running cycle 1/1 for dromaeo_css test... 04:23:21 INFO - TEST-INFO | started process 7699 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmp9ANju1/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:23:22 INFO - PROCESS | 7699 | 04:23:22 INFO - PROCESS | 7699 | (process:7762): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:23:32 INFO - PROCESS | 7699 | RSS: Main: 141643776 04:23:32 INFO - PROCESS | 7699 | 04:24:22 INFO - PROCESS | 7699 | 1456489462531 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] 04:26:30 INFO - PROCESS | 7699 | Cycle 1(1): loaded http://localhost:48320/tests/dromaeo/cssquery-dojo.html (next: http://localhost:48320/tests/dromaeo/cssquery-ext.html) 04:26:31 INFO - PROCESS | 7699 | RSS: Main: 145616896 04:26:31 INFO - PROCESS | 7699 | 04:29:33 INFO - PROCESS | 7699 | Cycle 1(1): loaded http://localhost:48320/tests/dromaeo/cssquery-ext.html (next: http://localhost:48320/tests/dromaeo/cssquery-jquery.html) 04:29:33 INFO - PROCESS | 7699 | RSS: Main: 145125376 04:29:33 INFO - PROCESS | 7699 | 04:32:35 INFO - PROCESS | 7699 | Cycle 1(1): loaded http://localhost:48320/tests/dromaeo/cssquery-jquery.html (next: http://localhost:48320/tests/dromaeo/cssquery-mootools.html) 04:32:35 INFO - PROCESS | 7699 | RSS: Main: 143355904 04:32:35 INFO - PROCESS | 7699 | 04:35:37 INFO - PROCESS | 7699 | Cycle 1(1): loaded http://localhost:48320/tests/dromaeo/cssquery-mootools.html (next: http://localhost:48320/tests/dromaeo/cssquery-prototype.html) 04:35:38 INFO - PROCESS | 7699 | RSS: Main: 144269312 04:35:38 INFO - PROCESS | 7699 | 04:38:40 INFO - PROCESS | 7699 | Cycle 1(1): loaded http://localhost:48320/tests/dromaeo/cssquery-prototype.html (next: http://localhost:48320/tests/dromaeo/cssquery-yui.html) 04:38:41 INFO - PROCESS | 7699 | RSS: Main: 143347712 04:38:41 INFO - PROCESS | 7699 | 04:41:43 INFO - PROCESS | 7699 | Cycle 1(1): loaded http://localhost:48320/tests/dromaeo/cssquery-yui.html (next: http://localhost:48320/tests/dromaeo/cssquery-dojo.html) 04:41:43 INFO - PROCESS | 7699 | RSS: Main: 146784256 04:41:43 INFO - PROCESS | 7699 | 04:41:43 INFO - PROCESS | 7699 | __start_tp_report 04:41:43 INFO - PROCESS | 7699 | _x_x_mozilla_page_load 04:41:43 INFO - PROCESS | 7699 | _x_x_mozilla_page_load_details 04:41:43 INFO - PROCESS | 7699 | |i|pagename|runs| 04:41:43 INFO - PROCESS | 7699 | |0;dojo.html;3301.6038075430943;3317.751168662351;3321.1697075731067;3361.8487168077436;3370.2922386298874;5394.487523685249;5411.675299482029;5424.0779067558515;5424.918626220609;5443.727813609324;5398.8920221595645;5405.027095122877;5406.08096623574;5431.293931788862;5453.454654534545;4937.753112344386;4975.402951645808;5058.4435712071645;5087.56755675768;5125.231215317714;4797.448293446246;4892.804287828482;4960.67755595887;4961.801527938878;5003;4965.801367945278;5025.773840177182;5031.748412579356;5040.1935690289565;5040.445550989388;5031.4465408805;5034.848954531333;5051.772670229849;5070.416902056237;5092;4793.784279707422;4862.294967229732;4896.314515967767;4959.270250353521;4972;5209.817656382009;5278.340207474066;5280.841574752763;5284.550813180885;5333.306670132858;5771.624844385144;5798.739056742456;5800.419958004208;5830.096335068071;5830.125481177814;5638.802641907513;5742.253507044099;5781.335146458169;5849.707514624294;5860.267466566679;5548.056830338812;5551.8889622207735;5553.972230138864;5557.833265002057;5561.971035358471;5962.821115366546;6016.308124565643;6029.306629737636;6032.245969253843;6044.03295472731;5544.445555444423;5642.040853054908;5743.6266642668925;5779.219805326227;5802.129680547867;5780.826575202751;5792.420757924258;5816.796412125555;5824.737886795105;5840.912386314209;5729.083346664597;5763.7982670606325;5768.1636162757;5768.596198266081;5779.075347944393;5644.153376993484;5702.230198923092;5729.627574207663;5776.595638305278;5858.472737453564;4469.664775141812;4479.888002799956;4483.327500874895;4496.820127194941;4497.010657655311;4023.1551374211745;4023.4568333274633;4025.6376926076796;4047.3321901886447;4063.1061166543313;5382.138857782736;5461.890762184734;5535.750891209906;5604.579656525695;5674.347450043298;5787.681677507778;5804.9419505805245;5806.941930580725;5807.0998995155815;5809.82570522885;5393.4336894626285;5512.862178445491;5519.31008623922;5530.198121272393;5534.059209934321;4964.032013757354;5066.544011038951;5106.642535022587;5132.127538318495;5141.897162056738;5891.1457838614015;5925.525957923356;5975.312839023481;5983.970080149571;5991.101334799815;5668.603197776116;5795.913061304168;5821.767129314865;5828.329742079545;5831.591788574759;5794;5813.04084825999;6034.577579569388;6088.573799833969;6144.56988010835;5825.563082768725;5848.53211743051;5854.180414742024;5868;5888.970555147197;5677.716114194356;5904.350521442552;5932.228810254639;5960.314563825215;5964.671943043;5583.190437386637;5712.257406537124;5788.102844059177;5792.189093526826;5818.563607729353;5677.1768093627015;5690.630109042899;5695.7436915338085;5698.088305871041;5700.144978253129;5615.943840561542;5618.297712785902;5620.072688006433;5621.184928185472;5635.661860288232;5560.63891154302;5574.470425309589;5622.7469763861545;5756.740946657326;5802.506786923159;5563.499285064202;5594.356648985256;5603.467670571289;5622.24099746529;5634.408387119457 04:41:43 INFO - PROCESS | 7699 | |1;ext.html;557.7148969086933;572.9026065568853;584.0771580902175;592.1325258496302;634.4543692424511;38669;39095.41356879649;39316.21367572647;39410.80294598526;39634.8018259909;42188;42769.572304276946;42800.35799463003;42823.35764963528;42835.14329713412;8853.955730221356;9003.054679258648;9028.77428064297;9061.275097992178;9092.818143637123;8751.956240218822;8867.73396798097;8901.465912045265;9052.456852588833;9091.363604547685;9074.77313067172;9158.679446219383;9161.633534658638;9178.632854685804;9210.217131543826;9042.502662353569;9145.268378529769;9152;9156.633734650606;9179.632814687404;8815;8819.955900220522;8931.955340223321;9109.81780364389;9134.862977055349;43273;43834.12331753379;43897.561024389666;43928.12143757139;44158.77920610408;3576.7138628909624;3652.8721494747556;3693.741438099334;3764.7552909060823;3959.2675355059405;32690.673093269;32729.509057364157;32750.672493275;32807.50788738171;33196.3360732784;4319.546447622985;4335.653147748204;4368.104538569585;4388.27593447084;4434.689571729948;297205;298213;298904;300466;332298;65173;65646.67176664181;65788.67105664537;66178.66910665415;66395;70597.64701176564;71278.64360678164;71382.28617713756;71404.2859571408;71457;16532.586685332964;16567.42014029503;16711.83288167127;16723.83276167247;16757.65938724899;11994.700132496582;12051.457684404222;12074.396280185956;12080.879191207976;12088.456019479145;22171.334859954226;22298.331050068526;22331.21840735599;22375.44061398478;22377.32868013962;8705.6517739291;8824.205821476098;8833.586626139786;8908.242799361997;9048.864267036;1069.4118234970736;1134.6425875849081;1141.8743938166795;1153.7346410325504;1224.871388504212;30513.086613469684;30713.84643076815;30736.385272294876;30864.69135308663;31064;1137.1528211482498;1160.1356989043218;1202.5550546297925;1221.1940119521073;1232.3406977267118;14652.633684157981;14678.266086695623;14925.029873058216;15266.236688165547;15321.387144514318;422823;531553;562087;566239;568563;54226.45773542293;55213;55232;55257;55524.16713749297;1453.6656568989192;1489.8957073005001;1499.235389951111;1506.1565523306983;1507.0505581483594;31797.841010794797;31892.521612175373;32616.184595385304;33434.33131337408;33996.66003340034;49812;50389.74805125951;50417;50443.747781260856;50622.74688626533;313645;319073;319159;319404;320224;45891.54108459006;45906;45971.3104303429;46679.766601166775;47039.294410583185;48457.75771121263;50368.24447633362;50555.74722126366;51563.22655160101;52226.21660675017;38216.42675359928;39189.41215881707;39803.40294895637;40319.1936161281;40480.797596011835;38696.226075478895;39182;39332.80333598314;41440.171196576506;43894.34158487561;37076.07309817276;37565;37854.62145378511;37867.81066094652;38066.238675226894;32596.185095372806;32757.181070473427;32923.835380822944;33043.83478082594;33176;26187.869060654575;26605.86697066502;26744.46511069729;28528.521037164945;29855.402891942475 04:41:43 INFO - PROCESS | 7699 | |2;jquery.html;395.57278139609224;396.6291517431203;400.3554277613043;400.5053758608117;403.91517781265935;14882.330295136719;15528.767068493982;17439.389621363254;17890.194941227644;17919.46241612754;10964.725881852957;11566.363849988269;15065.62335941602;18154.909225453855;18381.172847221875;5119.7184154871375;5359.812406565771;5640.097584386499;5651.378348381675;5658.519025882805;5256.159014557672;5434.7826086956475;5467.043267428204;5583.246261754652;5650.6892120933335;5263;5426.810061647843;5453.2092846537225;5466.453354664522;5499.450054994509;5628.549716022709;5632.690202038886;5668.206451096849;5677.772889084432;5698.259226300595;5421.620486565942;5625.46558076982;5657.1514272858985;5662.518685911702;5663.405342439067;14199.36102875373;18131.002794846278;21537.030833612524;21972;22193.55612887733;2234.7765223477686;2357.210334537932;2402.9519409611885;2435.232901635979;2493.9376515587073;10213.897861021369;10218;10248.180145588334;10303.227257955683;10572.15422766177;1800.5228614417058;1853.3142737187327;1904.1621686457913;1954.3843689237845;1966.301962803213;60574.39425605732;62148.37851621516;64197.358026419606;64309.3569064308;64430.67784661094;10901.945490272656;11102.389368584643;11146.777064458827;11171;11198.328100314007;14730.55808325752;14791.778123328158;14828.110313381232;14889.553313400615;14899.329530171168;7893;8015.559144247122;8032.879506807402;8052.637631306605;8100.554469504234;7405.7778266652085;7413.1104267488245;7456.85086298271;7463.626818659045;7484.962575187089;4644.744539050384;4795.976020119877;4824.903501930012;4834.323194752737;4883.8290659826735;1921.807819218067;2028.3712049264775;2035.908384122718;2047.3346162497248;2048.6107639548436;994.7562847102506;1001.5042553935702;1026.2559644257854;1033.4109557552124;1047.4919663962971;16906.830931690525;17203.65592688139;17498.641487235007;17590.208440619946;17826.48474879624;910.8542633178793;960.9759756006156;976.1848856205006;995.9053889880595;1052.4001319247955;9278.768030799283;9320.347575669774;9417.387869788441;9845.113939745457;9929.92693449047;439281;443750;444543;641205;654738.726306375;49130.75434622804;49188;49968;74441.62779186177;77699.61150194213;1122.354646078508;1147.2313549921573;1167.5796713183247;1201.507381973404;1208.4863932828512;16230.756538652166;16274.593135171242;16578.336866525206;16768.664626707152;16928.49214523566;31638;32545.349093017532;32642;32921.83539082289;33801.323973520884;40088.59911400849;40899.7955010223;41545.79227103966;43769.12461750811;43769.78115109404;3172.27037781307;4174.519930207944;5699.430056994267;7393;8119.878201827096;3602.0274525877344;3660.652238037382;4305.418768466342;10903.509342079467;11175.944120279672;10028.29801913859;10733.570657173626;10759;10760.946195268974;10900.727481813017;9512.09635084666;9814.558344874355;10045.397276163454;10246.590136394461;10791.892081079088;9833.16418104469;10376.844347334947;10399;10454.581816727246;10797.514111864828;7712;8193.631286591999;8285.4200205985;8348.749537513884;8375.329973601976;8296.958515207385;10316.27786054969;10491.527881245209;10609.045185933302;10764.300320479144 04:41:43 INFO - PROCESS | 7699 | |3;mootools.html;1584.2791529853919;1603.366670165285;1840.4386662068064;1900.44886982775;1930.3629802165296;7326.890096648554;7452.217517160701;8107.270345668889;8298.5435801031;8299.419040667148;7759.534427934328;7821.452498325119;7880.881786773203;7917.604119794016;7978.640961156747;2389.06826337728;2419.9957017837664;2421.87890605469;2425.333033415816;2429.380507970474;2419.250032489925;2450.4608986023136;2455.7667021632915;2488.7884529814896;2496.8002559795264;2324.23300310897;2332.055517515409;2395.880205989702;2424.1151979527435;2440.987795061022;2406.097713357491;2407.518496300738;2412.3004328744732;2435.512897420523;2473.75262473753;2332.7084114485688;2338.216697406354;2339.146211632759;2342.472943587696;2364.574376612209;8357.83284334316;8388.32893368529;8439.789005274855;8451;8468.83062338756;5071.7210553419545;5156.510131537498;5161.767720452551;5163.845084647466;5176.275321454999;3099.070278916339;3114.314850732835;3181.459151944175;3226.354729054175;3278.37710834943;1086.7120213143523;1089.1014912696978;1099.796537640539;1109.0850048709847;1112.2040919224353;11475;11480.196386252966;11502.597409090726;11510.251833630788;11541.192116551845;4760.833370832004;4776.307435421844;4778.402699662543;4815.662903596714;4842.709437433765;9710.077542633438;9728.124468797841;9735.464549449849;9755.9024409755;9789.657361992438;5031.345925029796;5040.747962601855;5066.721330326867;5069.949300506948;5074.898502029939;4515.525869783691;4666.836660716926;4696.225122854691;4760.214564596803;4790.401199850019;3866.613338666111;3901.843926242975;3910.6089391061237;3956.940645890314;3977.880663580097;1184.1710802438329;1189.2151180221013;1201.141184053406;1205.054032584417;1236.6537369536545;1128.3342827731678;1128.9604863829727;1147.822087576427;1384.2940100548792;1451.8765904898203;7759.068911730628;7770.844583108419;7778.377729781604;7800.375969922393;7982.640781164861;1184.1829137894824;1190.7380376317196;1210.2496452199694;1218.1229514749366;1224.0391292835081;6120.632762034292;6139.3553676863285;6182.567220294626;6196.318404975449;6224.813255602339;9866.062724041205;10190.133838623651;10196.643117490852;10240.897591024144;10309.587616495406;10044.698659040241;10084.949575252223;10242.129418999319;10288.228382871164;10313.84529232062;7858.528488290721;7964.522128672298;7984.481008734414;7996.440249182501;8021.919780802117;7586.24137586237;7642.04474440695;7648.694052237848;7684.3084122429245;7696.037995250594;8769.91230087691;9078.319126065704;9123.908760912305;9140.497272650067;9154.633814647339;9165.350236957145;9254.537273136451;9255.167034966886;9446.24430045581;9491.098345657152;7043.577385356895;7168.641567921479;7239.638018099179;7406.740764073232;7416.48084634092;7893.052833659768;7904.84190316202;7908.4464087513325;7931.841363172589;7950.642221099949;7329.596872172082;7461.253874612496;7560.508566943131;7562.697492100475;7633.618319084135;7298.781036568911;7330.633468326669;7333.413326933725;7398.9630051851545;7576.128745194374;7581.924180758342;7609.88585171234;7632.847343052997;7661.770146895602;7716.884246736416;6788.083608712958;6847.863042739018;6901.413379862768;6931.6880740367815;6942.236354000955;7062.364387205176;7081.82295442618;7081.858362832818;7114.21743608213;7128.607926563881 04:41:43 INFO - PROCESS | 7699 | |4;prototype.html;361.7702758748194;362.213995629484;368.1991668121834;375.64313901793304;377.1890435563538;6275.403836635513;6335.5565110442285;6467.417932386084;6473.611583304999;6480.935190648092;6167.167432396625;6315.715792789324;6351.856665800154;6360.840978975528;6399.424051835334;4925.162722337193;4936.481669424695;4942.530459606341;4945.579625731799;4948.8267910623135;4921.18800397934;4921.8277360292395;4923.089228492722;4927.113119638464;4957.3059771632;4695.60087392572;4858.951410485885;4864.975675121619;4868.975655121737;4869.464358920516;4838.153323168432;4847.2002119650215;4850.854474365757;4857.222844344923;4858.708477491362;4223.408722778782;4226.218149642326;4231.576842315744;4238.978805105955;4243.384709217177;5975.940240597582;6065.514758819284;6084.665343406111;6099.817005489843;6105.572609917308;5613.46672066153;5643.181738647914;5653.208550802891;5659.122835960392;5673.26247587815;6709.966450167718;6710.3625155610625;6758.290379510179;6771.356721111487;6785.72857085716;4639.280911458729;4672.018876036036;4673.5793778559755;4680.485146633868;4700.576948074689;6911.2397636259975;7061.082059332254;7098.39663628587;7125.465590080765;7125.5368401053765;4799.520047995243;4804;4806;4810.518948105161;4813.253945638432;4865.5864251538305;4867.440244371872;4880.682755620945;4880.731559764247;4887.120318342661;5473.28847249863;5614.382417934024;5629.634073785191;5638.379778224392;5654.858628534237;6822.044913712084;6867.07294515234;6870.553414028072;6877.140357455318;6883.965580172067;1642.852143307108;1668.7580300856307;1679.6808606364752;1691.687037897993;1693.796744390681;1138.0838425067734;1148.9770204595861;1149.6780901347636;1150.1431433582036;1159.7796418680423;6430.3891130342545;6506.284308726036;6544.247411547733;6544.44372228366;6569.737210511622;6930.8613827724175;6959.09531760878;6960.756373526902;6974.651267436608;6975.965120174366;6493.383128602775;6522.282548919615;6534.607923524603;6535.640539770263;6538.444232240217;3828.6362795534938;3830.693544516432;3831.3295173344554;3856.749311294757;3857.7685338879196;7336.339729424378;7365.447591430664;7382.077240344957;7391.15001774792;7408.296211859864;7102.289771022856;7197.100362454693;7234.674439650228;7274.672639731225;7296.124465064227;7236.819079523054;7306.926930730625;7315.926840731525;7347.338739513362;7362.484626076231;7042.471814613822;7068.858622827412;7075.893861591977;7114.608696521534;7138.85722285541;6771.932280677327;6977.33715297046;6996.370326670624;7008.719651213894;7034.5427547209265;7311.780646580611;7316.1952185258515;7316.707331706672;7334.743283985035;7334.963325183553;4920;4942.604591632733;4953.702777833341;4961.603071754179;4969.726665033313;6928.688209030505;6989.091418115612;7052.682629281592;7120.359167674934;7122.643867806485;6950.54821436605;6954.860902782018;6977.965110174417;6989.37095661393;7001.754938577125;6874;6892.793216203522;6894.172699276119;6894.689738961659;6896.655167241718;6626.933730662631;6746.257911629618;6773.89839152423;6798.796036118924;6806.8638627228165;6941.687624056828;6967.756128535477;6968.163820341591;6984.860302794017;6986.231514533499;6696;6749.291324410866;6761.86476270462;6766.086578311865;6770.796876093725 04:41:43 INFO - PROCESS | 7699 | |5;yui.html;926.9861499706273;932.6269492203118;936.8735220745198;940.6848705683597;959.7312752429323;13483.662908427294;13557;14538.41846326147;14602.415903363866;15002.324895379707;14197.290135493236;14288;14305.213213273291;14308.069975451588;14380.784288235685;875.3653601139155;881.7178502879066;889.4974339498195;892.3530440430701;896.3008853094597;880.9867851982225;896.4755617963499;896.4979611417594;900.0324651000201;901.4140808474511;918.191991047877;922.0687106022932;922.6217250927122;924.2744445610198;927.4481683398367;904.3036861616584;904.9185573298435;913.6025828764475;915.839728047589;917.2341095185461;686.8626274745021;689.7965100295424;696.6377483708494;698.3575110897985;699.3076853914639;15610.765838512318;15632.452864149815;15680.451184208612;15699.607509812231;15783.605409864731;13975.440982360693;14011.08927919682;14019;14123.717525649532;14135.71728565423;11344.43277836105;11377.488013039432;11402.714932126763;11442.828357574643;11561.942190289079;4518.597826949;4575.450945886481;4596.448426188846;4617.630589552861;4620.537946205386;50734.746326268134;50920.490795092315;50957.235641465406;50978;51054.74472627688;10755.731106722238;11168.441577921072;11201.495932683049;11271.661850144508;11461.713457163638;19020.144093515824;19197.32809351666;19236.422907312804;19274.8072519273;19345.806541934402;7868.685252589832;7955.84088318242;8157.592120393957;8232.958835205785;8315.708950186836;4426.667999900021;4434.312681534368;4448.199324121689;4451.087527056946;4522.683412161117;3148.7481001519823;3151.5745374374624;3165.3036332006923;3177.5551422800827;3179.8092114473206;622.9377062293825;630.9621422714652;631.1542533005703;631.7757196195377;640.6252342379667;719.463999320499;738.4240292571695;743.2047708951478;755.4824944912752;772.9690812367443;10446.320989135682;10449.425281609585;10661.09380702649;10821.513031913582;10952.233343665866;630.3286999345682;706.1914108346018;721.841194937113;729.4310437858479;747.517850986111;4507.909841803145;4716.056788642285;4828.758562071883;4895.192293271571;4943.530364615356;61121.38878611246;61895.38104618986;62256.377436225965;62477.687611561654;63082.68458657769;51752.74123629358;52863;55159.44840551543;55678.72160639252;55711;47341.28988065182;49700.50299497031;50395.49604503908;50586.747066264434;51381.743091285054;9800.607975680892;9956.950215248877;9972.30193886421;10053.246006549392;10097.848532271875;37058.629413705516;37671.24657506889;38108.04729881775;38357.04107397337;38509.037274068374;44154;44696;48636.75681621711;48935;49104.2634360492;11841.82237266459;11867.881321186678;12005.579804706793;12046.698832528906;12314.75370492603;12751.426185821845;12809.103362764517;12819.038572106943;13063.150895191782;13844.10013349129;12228.44971976281;12717.745645087232;12912.096153269182;13013.934930325666;13612.93193534026;11704.94147529257;11826.586069487526;11931.880681193077;12034.63896083119;12076;12762;12762.106652534234;13067.085304028627;13286.800697989345;13309.267990260629;10102.292839501459;10332.948335258276;10359.171266298828;10580.576776929145;10649.414282214553;10934.617288394868;11034.668959931216;11093.611723589636;11106.167037472384;11191.44042797873 04:41:43 INFO - PROCESS | 7699 | __end_tp_report 04:41:43 INFO - PROCESS | 7699 | __start_cc_report 04:41:43 INFO - PROCESS | 7699 | _x_x_mozilla_cycle_collect,290 04:41:43 INFO - PROCESS | 7699 | __end_cc_report 04:41:43 INFO - PROCESS | 7699 | __startTimestamp1456490503573__endTimestamp 04:41:43 INFO - PROCESS | 7699 | 04:41:43 INFO - PROCESS | 7699 | ------- Summary: start ------- 04:41:43 INFO - PROCESS | 7699 | Number of tests: 6 04:41:43 INFO - PROCESS | 7699 | 04:41:43 INFO - PROCESS | 7699 | [#0] dojo.html Cycles:165 Average:5417.40 Median:5618.30 stddev:580.74 (10.3%) stddev-sans-first:558.30 04:41:43 INFO - PROCESS | 7699 | Values: 3301.6 3317.8 3321.2 3361.8 3370.3 5394.5 5411.7 5424.1 5424.9 5443.7 5398.9 5405.0 5406.1 5431.3 5453.5 4937.8 4975.4 5058.4 5087.6 5125.2 4797.4 4892.8 4960.7 4961.8 5003.0 4965.8 5025.8 5031.7 5040.2 5040.4 5031.4 5034.8 5051.8 5070.4 5092.0 4793.8 4862.3 4896.3 4959.3 4972.0 5209.8 5278.3 5280.8 5284.6 5333.3 5771.6 5798.7 5800.4 5830.1 5830.1 5638.8 5742.3 5781.3 5849.7 5860.3 5548.1 5551.9 5554.0 5557.8 5562.0 5962.8 6016.3 6029.3 6032.2 6044.0 5544.4 5642.0 5743.6 5779.2 5802.1 5780.8 5792.4 5816.8 5824.7 5840.9 5729.1 5763.8 5768.2 5768.6 5779.1 5644.2 5702.2 5729.6 5776.6 5858.5 4469.7 4479.9 4483.3 4496.8 4497.0 4023.2 4023.5 4025.6 4047.3 4063.1 5382.1 5461.9 5535.8 5604.6 5674.3 5787.7 5804.9 5806.9 5807.1 5809.8 5393.4 5512.9 5519.3 5530.2 5534.1 4964.0 5066.5 5106.6 5132.1 5141.9 5891.1 5925.5 5975.3 5984.0 5991.1 5668.6 5795.9 5821.8 5828.3 5831.6 5794.0 5813.0 6034.6 6088.6 6144.6 5825.6 5848.5 5854.2 5868.0 5889.0 5677.7 5904.4 5932.2 5960.3 5964.7 5583.2 5712.3 5788.1 5792.2 5818.6 5677.2 5690.6 5695.7 5698.1 5700.1 5615.9 5618.3 5620.1 5621.2 5635.7 5560.6 5574.5 5622.7 5756.7 5802.5 5563.5 5594.4 5603.5 5622.2 5634.4 04:41:43 INFO - PROCESS | 7699 | 04:41:43 INFO - PROCESS | 7699 | [#1] ext.html Cycles:180 Average:56286.91 Median:40061.30 stddev:105858.25 (264.2%) stddev-sans-first:106072.52 04:41:43 INFO - PROCESS | 7699 | Values: 557.7 572.9 584.1 592.1 634.5 38669.0 39095.4 39316.2 39410.8 39634.8 42188.0 42769.6 42800.4 42823.4 42835.1 8854.0 9003.1 9028.8 9061.3 9092.8 8752.0 8867.7 8901.5 9052.5 9091.4 9074.8 9158.7 9161.6 9178.6 9210.2 9042.5 9145.3 9152.0 9156.6 9179.6 8815.0 8820.0 8932.0 9109.8 9134.9 43273.0 43834.1 43897.6 43928.1 44158.8 3576.7 3652.9 3693.7 3764.8 3959.3 32690.7 32729.5 32750.7 32807.5 33196.3 4319.5 4335.7 4368.1 4388.3 4434.7 297205.0 298213.0 298904.0 300466.0 332298.0 65173.0 65646.7 65788.7 66178.7 66395.0 70597.6 71278.6 71382.3 71404.3 71457.0 16532.6 16567.4 16711.8 16723.8 16757.7 11994.7 12051.5 12074.4 12080.9 12088.5 22171.3 22298.3 22331.2 22375.4 22377.3 8705.7 8824.2 8833.6 8908.2 9048.9 1069.4 1134.6 1141.9 1153.7 1224.9 30513.1 30713.8 30736.4 30864.7 31064.0 1137.2 1160.1 1202.6 1221.2 1232.3 14652.6 14678.3 14925.0 15266.2 15321.4 422823.0 531553.0 562087.0 566239.0 568563.0 54226.5 55213.0 55232.0 55257.0 55524.2 1453.7 1489.9 1499.2 1506.2 1507.1 31797.8 31892.5 32616.2 33434.3 33996.7 49812.0 50389.7 50417.0 50443.7 50622.7 313645.0 319073.0 319159.0 319404.0 320224.0 45891.5 45906.0 45971.3 46679.8 47039.3 48457.8 50368.2 50555.7 51563.2 52226.2 38216.4 39189.4 39803.4 40319.2 40480.8 38696.2 39182.0 39332.8 41440.2 43894.3 37076.1 37565.0 37854.6 37867.8 38066.2 32596.2 32757.2 32923.8 33043.8 33176.0 26187.9 26605.9 26744.5 28528.5 29855.4 04:41:43 INFO - PROCESS | 7699 | 04:41:43 INFO - PROCESS | 7699 | [#2] jquery.html Cycles:180 Average:27032.32 Median:2028.11 stddev:87275.43 (4303.3%) stddev-sans-first:87497.34 04:41:43 INFO - PROCESS | 7699 | Values: 395.6 396.6 400.4 400.5 403.9 14882.3 15528.8 17439.4 17890.2 17919.5 10964.7 11566.4 15065.6 18154.9 18381.2 5119.7 5359.8 5640.1 5651.4 5658.5 5256.2 5434.8 5467.0 5583.2 5650.7 5263.0 5426.8 5453.2 5466.5 5499.5 5628.5 5632.7 5668.2 5677.8 5698.3 5421.6 5625.5 5657.2 5662.5 5663.4 14199.4 18131.0 21537.0 21972.0 22193.6 2234.8 2357.2 2403.0 2435.2 2493.9 10213.9 10218.0 10248.2 10303.2 10572.2 1800.5 1853.3 1904.2 1954.4 1966.3 60574.4 62148.4 64197.4 64309.4 64430.7 10901.9 11102.4 11146.8 11171.0 11198.3 14730.6 14791.8 14828.1 14889.6 14899.3 7893.0 8015.6 8032.9 8052.6 8100.6 7405.8 7413.1 7456.9 7463.6 7485.0 4644.7 4796.0 4824.9 4834.3 4883.8 1921.8 2028.4 2035.9 2047.3 2048.6 994.8 1001.5 1026.3 1033.4 1047.5 16906.8 17203.7 17498.6 17590.2 17826.5 910.9 961.0 976.2 995.9 1052.4 9278.8 9320.3 9417.4 9845.1 9929.9 439281.0 443750.0 444543.0 641205.0 654738.7 49130.8 49188.0 49968.0 74441.6 77699.6 1122.4 1147.2 1167.6 1201.5 1208.5 16230.8 16274.6 16578.3 16768.7 16928.5 31638.0 32545.3 32642.0 32921.8 33801.3 40088.6 40899.8 41545.8 43769.1 43769.8 3172.3 4174.5 5699.4 7393.0 8119.9 3602.0 3660.7 4305.4 10903.5 11175.9 10028.3 10733.6 10759.0 10760.9 10900.7 9512.1 9814.6 10045.4 10246.6 10791.9 9833.2 10376.8 10399.0 10454.6 10797.5 7712.0 8193.6 8285.4 8348.7 8375.3 8297.0 10316.3 10491.5 10609.0 10764.3 04:41:43 INFO - PROCESS | 7699 | 04:41:43 INFO - PROCESS | 7699 | [#3] mootools.html Cycles:180 Average:5855.79 Median:5159.14 stddev:3028.30 (58.7%) stddev-sans-first:3019.78 04:41:43 INFO - PROCESS | 7699 | Values: 1584.3 1603.4 1840.4 1900.4 1930.4 7326.9 7452.2 8107.3 8298.5 8299.4 7759.5 7821.5 7880.9 7917.6 7978.6 2389.1 2420.0 2421.9 2425.3 2429.4 2419.3 2450.5 2455.8 2488.8 2496.8 2324.2 2332.1 2395.9 2424.1 2441.0 2406.1 2407.5 2412.3 2435.5 2473.8 2332.7 2338.2 2339.1 2342.5 2364.6 8357.8 8388.3 8439.8 8451.0 8468.8 5071.7 5156.5 5161.8 5163.8 5176.3 3099.1 3114.3 3181.5 3226.4 3278.4 1086.7 1089.1 1099.8 1109.1 1112.2 11475.0 11480.2 11502.6 11510.3 11541.2 4760.8 4776.3 4778.4 4815.7 4842.7 9710.1 9728.1 9735.5 9755.9 9789.7 5031.3 5040.7 5066.7 5069.9 5074.9 4515.5 4666.8 4696.2 4760.2 4790.4 3866.6 3901.8 3910.6 3956.9 3977.9 1184.2 1189.2 1201.1 1205.1 1236.7 1128.3 1129.0 1147.8 1384.3 1451.9 7759.1 7770.8 7778.4 7800.4 7982.6 1184.2 1190.7 1210.2 1218.1 1224.0 6120.6 6139.4 6182.6 6196.3 6224.8 9866.1 10190.1 10196.6 10240.9 10309.6 10044.7 10084.9 10242.1 10288.2 10313.8 7858.5 7964.5 7984.5 7996.4 8021.9 7586.2 7642.0 7648.7 7684.3 7696.0 8769.9 9078.3 9123.9 9140.5 9154.6 9165.4 9254.5 9255.2 9446.2 9491.1 7043.6 7168.6 7239.6 7406.7 7416.5 7893.1 7904.8 7908.4 7931.8 7950.6 7329.6 7461.3 7560.5 7562.7 7633.6 7298.8 7330.6 7333.4 7399.0 7576.1 7581.9 7609.9 7632.8 7661.8 7716.9 6788.1 6847.9 6901.4 6931.7 6942.2 7062.4 7081.8 7081.9 7114.2 7128.6 04:41:43 INFO - PROCESS | 7699 | 04:41:43 INFO - PROCESS | 7699 | [#4] prototype.html Cycles:180 Average:5708.46 Median:6487.16 stddev:1733.29 (26.7%) stddev-sans-first:1691.06 04:41:43 INFO - PROCESS | 7699 | Values: 361.8 362.2 368.2 375.6 377.2 6275.4 6335.6 6467.4 6473.6 6480.9 6167.2 6315.7 6351.9 6360.8 6399.4 4925.2 4936.5 4942.5 4945.6 4948.8 4921.2 4921.8 4923.1 4927.1 4957.3 4695.6 4859.0 4865.0 4869.0 4869.5 4838.2 4847.2 4850.9 4857.2 4858.7 4223.4 4226.2 4231.6 4239.0 4243.4 5975.9 6065.5 6084.7 6099.8 6105.6 5613.5 5643.2 5653.2 5659.1 5673.3 6710.0 6710.4 6758.3 6771.4 6785.7 4639.3 4672.0 4673.6 4680.5 4700.6 6911.2 7061.1 7098.4 7125.5 7125.5 4799.5 4804.0 4806.0 4810.5 4813.3 4865.6 4867.4 4880.7 4880.7 4887.1 5473.3 5614.4 5629.6 5638.4 5654.9 6822.0 6867.1 6870.6 6877.1 6884.0 1642.9 1668.8 1679.7 1691.7 1693.8 1138.1 1149.0 1149.7 1150.1 1159.8 6430.4 6506.3 6544.2 6544.4 6569.7 6930.9 6959.1 6960.8 6974.7 6976.0 6493.4 6522.3 6534.6 6535.6 6538.4 3828.6 3830.7 3831.3 3856.7 3857.8 7336.3 7365.4 7382.1 7391.2 7408.3 7102.3 7197.1 7234.7 7274.7 7296.1 7236.8 7306.9 7315.9 7347.3 7362.5 7042.5 7068.9 7075.9 7114.6 7138.9 6771.9 6977.3 6996.4 7008.7 7034.5 7311.8 7316.2 7316.7 7334.7 7335.0 4920.0 4942.6 4953.7 4961.6 4969.7 6928.7 6989.1 7052.7 7120.4 7122.6 6950.5 6954.9 6978.0 6989.4 7001.8 6874.0 6892.8 6894.2 6894.7 6896.7 6626.9 6746.3 6773.9 6798.8 6806.9 6941.7 6967.8 6968.2 6984.9 6986.2 6696.0 6749.3 6761.9 6766.1 6770.8 04:41:43 INFO - PROCESS | 7699 | 04:41:43 INFO - PROCESS | 7699 | [#5] yui.html Cycles:180 Average:14994.51 Median:4449.64 stddev:16979.40 (381.6%) stddev-sans-first:16994.16 04:41:43 INFO - PROCESS | 7699 | Values: 927.0 932.6 936.9 940.7 959.7 13483.7 13557.0 14538.4 14602.4 15002.3 14197.3 14288.0 14305.2 14308.1 14380.8 875.4 881.7 889.5 892.4 896.3 881.0 896.5 896.5 900.0 901.4 918.2 922.1 922.6 924.3 927.4 904.3 904.9 913.6 915.8 917.2 686.9 689.8 696.6 698.4 699.3 15610.8 15632.5 15680.5 15699.6 15783.6 13975.4 14011.1 14019.0 14123.7 14135.7 11344.4 11377.5 11402.7 11442.8 11561.9 4518.6 4575.5 4596.4 4617.6 4620.5 50734.7 50920.5 50957.2 50978.0 51054.7 10755.7 11168.4 11201.5 11271.7 11461.7 19020.1 19197.3 19236.4 19274.8 19345.8 7868.7 7955.8 8157.6 8233.0 8315.7 4426.7 4434.3 4448.2 4451.1 4522.7 3148.7 3151.6 3165.3 3177.6 3179.8 622.9 631.0 631.2 631.8 640.6 719.5 738.4 743.2 755.5 773.0 10446.3 10449.4 10661.1 10821.5 10952.2 630.3 706.2 721.8 729.4 747.5 4507.9 4716.1 4828.8 4895.2 4943.5 61121.4 61895.4 62256.4 62477.7 63082.7 51752.7 52863.0 55159.4 55678.7 55711.0 47341.3 49700.5 50395.5 50586.7 51381.7 9800.6 9957.0 9972.3 10053.2 10097.8 37058.6 37671.2 38108.0 38357.0 38509.0 44154.0 44696.0 48636.8 48935.0 49104.3 11841.8 11867.9 12005.6 12046.7 12314.8 12751.4 12809.1 12819.0 13063.2 13844.1 12228.4 12717.7 12912.1 13013.9 13612.9 11704.9 11826.6 11931.9 12034.6 12076.0 12762.0 12762.1 13067.1 13286.8 13309.3 10102.3 10332.9 10359.2 10580.6 10649.4 10934.6 11034.7 11093.6 11106.2 11191.4 04:41:43 INFO - PROCESS | 7699 | -------- Summary: end -------- 04:41:43 INFO - PROCESS | 7699 | 04:41:44 INFO - TEST-INFO | 7699: exit 0 04:41:44 INFO - TEST-OK | dromaeo_css | took 1108724ms 04:41:44 INFO - TEST-START | kraken 04:41:44 INFO - operating with platform_type : linux_ 04:41:44 INFO - Initialising browser for kraken test... 04:41:44 INFO - TEST-INFO | started process 7939 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOeVDYb/profile http://localhost:48320/getInfo.html) 04:41:47 INFO - PROCESS | 7939 | 04:41:47 INFO - PROCESS | 7939 | (process:8016): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:41:48 INFO - PROCESS | 7939 | __metrics Screen width/height:1600/1200 04:41:48 INFO - PROCESS | 7939 | colorDepth:24 04:41:48 INFO - PROCESS | 7939 | Browser inner width/height: 1024/697 04:41:48 INFO - PROCESS | 7939 | __metrics 04:41:49 INFO - TEST-INFO | 7939: exit 0 04:41:49 INFO - Browser initialized. 04:41:49 INFO - Running cycle 1/1 for kraken test... 04:41:49 INFO - TEST-INFO | started process 8065 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpOeVDYb/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:41:50 INFO - PROCESS | 8065 | 04:41:50 INFO - PROCESS | 8065 | (process:8131): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:42:01 INFO - PROCESS | 8065 | RSS: Main: 141221888 04:42:01 INFO - PROCESS | 8065 | 04:42:03 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:48320/tests/kraken/driver.html?testName=audio-beat-detection) 04:42:04 INFO - PROCESS | 8065 | RSS: Main: 145571840 04:42:04 INFO - PROCESS | 8065 | 04:42:07 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:48320/tests/kraken/driver.html?testName=audio-dft) 04:42:07 INFO - PROCESS | 8065 | RSS: Main: 144936960 04:42:07 INFO - PROCESS | 8065 | 04:42:10 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:48320/tests/kraken/driver.html?testName=audio-fft) 04:42:11 INFO - PROCESS | 8065 | RSS: Main: 145952768 04:42:11 INFO - PROCESS | 8065 | 04:42:13 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:48320/tests/kraken/driver.html?testName=audio-oscillator) 04:42:13 INFO - PROCESS | 8065 | RSS: Main: 145211392 04:42:13 INFO - PROCESS | 8065 | 04:42:15 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:48320/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:42:16 INFO - PROCESS | 8065 | RSS: Main: 145326080 04:42:16 INFO - PROCESS | 8065 | 04:42:19 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:48320/tests/kraken/driver.html?testName=imaging-darkroom) 04:42:20 INFO - PROCESS | 8065 | RSS: Main: 145399808 04:42:20 INFO - PROCESS | 8065 | 04:42:23 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:48320/tests/kraken/driver.html?testName=imaging-desaturate) 04:42:24 INFO - PROCESS | 8065 | RSS: Main: 145350656 04:42:24 INFO - PROCESS | 8065 | 04:42:26 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:48320/tests/kraken/driver.html?testName=json-parse-financial) 04:42:27 INFO - PROCESS | 8065 | RSS: Main: 145281024 04:42:27 INFO - PROCESS | 8065 | 04:42:28 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:48320/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:42:29 INFO - PROCESS | 8065 | RSS: Main: 146661376 04:42:29 INFO - PROCESS | 8065 | 04:42:31 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:48320/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:42:31 INFO - PROCESS | 8065 | RSS: Main: 145076224 04:42:31 INFO - PROCESS | 8065 | 04:42:33 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:48320/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:42:34 INFO - PROCESS | 8065 | RSS: Main: 146210816 04:42:34 INFO - PROCESS | 8065 | 04:42:36 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:48320/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:42:37 INFO - PROCESS | 8065 | RSS: Main: 145592320 04:42:37 INFO - PROCESS | 8065 | 04:42:39 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:48320/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:42:40 INFO - PROCESS | 8065 | RSS: Main: 147566592 04:42:40 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | Cycle 1(1): loaded http://localhost:48320/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:48320/tests/kraken/driver.html?testName=ai-astar) 04:42:42 INFO - PROCESS | 8065 | RSS: Main: 148250624 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | __start_tp_report 04:42:42 INFO - PROCESS | 8065 | _x_x_mozilla_page_load 04:42:42 INFO - PROCESS | 8065 | _x_x_mozilla_page_load_details 04:42:42 INFO - PROCESS | 8065 | |i|pagename|runs| 04:42:42 INFO - PROCESS | 8065 | |0;ai-astar;112;106;113;110;110;120;109;110;111;112 04:42:42 INFO - PROCESS | 8065 | |1;audio-beat-detection;149;125;149;161;128;157;152;125;166;129 04:42:42 INFO - PROCESS | 8065 | |2;audio-dft;163;161;162;162;161;162;162;163;165;163 04:42:42 INFO - PROCESS | 8065 | |3;audio-fft;77;75;75;143;75;75;75;74;155;74 04:42:42 INFO - PROCESS | 8065 | |4;audio-oscillator;96;96;151;94;95;96;142;95;96;134 04:42:42 INFO - PROCESS | 8065 | |5;imaging-gaussian-blur;110;110;109;109;110;111;110;110;109;111 04:42:42 INFO - PROCESS | 8065 | |6;imaging-darkroom;147;147;147;147;146;147;148;147;148;147 04:42:42 INFO - PROCESS | 8065 | |7;imaging-desaturate;97;96;96;96;96;96;97;96;96;97 04:42:42 INFO - PROCESS | 8065 | |8;json-parse-financial;55;60;55;56;56;55;62;63;54;55 04:42:42 INFO - PROCESS | 8065 | |9;json-stringify-tinderbox;63;64;64;64;64;64;65;65;64;66 04:42:42 INFO - PROCESS | 8065 | |10;stanford-crypto-aes;78;78;80;80;79;80;81;80;79;82 04:42:42 INFO - PROCESS | 8065 | |11;stanford-crypto-ccm;126;113;126;117;110;114;112;112;112;112 04:42:42 INFO - PROCESS | 8065 | |12;stanford-crypto-pbkdf2;127;145;136;142;139;140;128;137;130;136 04:42:42 INFO - PROCESS | 8065 | |13;stanford-crypto-sha256-iterative;66;67;69;66;67;64;68;67;65;65 04:42:42 INFO - PROCESS | 8065 | __end_tp_report 04:42:42 INFO - PROCESS | 8065 | __start_cc_report 04:42:42 INFO - PROCESS | 8065 | _x_x_mozilla_cycle_collect,749 04:42:42 INFO - PROCESS | 8065 | __end_cc_report 04:42:42 INFO - PROCESS | 8065 | __startTimestamp1456490562443__endTimestamp 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | ------- Summary: start ------- 04:42:42 INFO - PROCESS | 8065 | Number of tests: 14 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#0] ai-astar Cycles:10 Average:111.30 Median:111.50 stddev:3.62 (3.2%) stddev-sans-first:3.83 04:42:42 INFO - PROCESS | 8065 | Values: 112.0 106.0 113.0 110.0 110.0 120.0 109.0 110.0 111.0 112.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#1] audio-beat-detection Cycles:10 Average:144.10 Median:150.50 stddev:15.84 (10.5%) stddev-sans-first:16.70 04:42:42 INFO - PROCESS | 8065 | Values: 149.0 125.0 149.0 161.0 128.0 157.0 152.0 125.0 166.0 129.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#2] audio-dft Cycles:10 Average:162.40 Median:162.50 stddev:1.17 (0.7%) stddev-sans-first:1.22 04:42:42 INFO - PROCESS | 8065 | Values: 163.0 161.0 162.0 162.0 161.0 162.0 162.0 163.0 165.0 163.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#3] audio-fft Cycles:10 Average:89.80 Median:75.00 stddev:31.34 (41.8%) stddev-sans-first:32.90 04:42:42 INFO - PROCESS | 8065 | Values: 77.0 75.0 75.0 143.0 75.0 75.0 75.0 74.0 155.0 74.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#4] audio-oscillator Cycles:10 Average:109.50 Median:95.50 stddev:23.02 (24.1%) stddev-sans-first:23.89 04:42:42 INFO - PROCESS | 8065 | Values: 96.0 96.0 151.0 94.0 95.0 96.0 142.0 95.0 96.0 134.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#5] imaging-gaussian-blur Cycles:10 Average:109.90 Median:110.00 stddev:0.74 (0.7%) stddev-sans-first:0.78 04:42:42 INFO - PROCESS | 8065 | Values: 110.0 110.0 109.0 109.0 110.0 111.0 110.0 110.0 109.0 111.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#6] imaging-darkroom Cycles:10 Average:147.10 Median:147.00 stddev:0.57 (0.4%) stddev-sans-first:0.60 04:42:42 INFO - PROCESS | 8065 | Values: 147.0 147.0 147.0 147.0 146.0 147.0 148.0 147.0 148.0 147.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#7] imaging-desaturate Cycles:10 Average:96.30 Median:96.00 stddev:0.48 (0.5%) stddev-sans-first:0.44 04:42:42 INFO - PROCESS | 8065 | Values: 97.0 96.0 96.0 96.0 96.0 96.0 97.0 96.0 96.0 97.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#8] json-parse-financial Cycles:10 Average:57.10 Median:56.00 stddev:3.28 (5.9%) stddev-sans-first:3.39 04:42:42 INFO - PROCESS | 8065 | Values: 55.0 60.0 55.0 56.0 56.0 55.0 62.0 63.0 54.0 55.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#9] json-stringify-tinderbox Cycles:10 Average:64.30 Median:64.00 stddev:0.82 (1.3%) stddev-sans-first:0.73 04:42:42 INFO - PROCESS | 8065 | Values: 63.0 64.0 64.0 64.0 64.0 64.0 65.0 65.0 64.0 66.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#10] stanford-crypto-aes Cycles:10 Average:79.70 Median:80.00 stddev:1.25 (1.6%) stddev-sans-first:1.17 04:42:42 INFO - PROCESS | 8065 | Values: 78.0 78.0 80.0 80.0 79.0 80.0 81.0 80.0 79.0 82.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#11] stanford-crypto-ccm Cycles:10 Average:115.40 Median:113.50 stddev:5.87 (5.2%) stddev-sans-first:4.82 04:42:42 INFO - PROCESS | 8065 | Values: 126.0 113.0 126.0 117.0 110.0 114.0 112.0 112.0 112.0 112.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:136.00 Median:138.00 stddev:6.00 (4.3%) stddev-sans-first:5.41 04:42:42 INFO - PROCESS | 8065 | Values: 127.0 145.0 136.0 142.0 139.0 140.0 128.0 137.0 130.0 136.0 04:42:42 INFO - PROCESS | 8065 | 04:42:42 INFO - PROCESS | 8065 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.40 Median:67.00 stddev:1.51 (2.2%) stddev-sans-first:1.59 04:42:42 INFO - PROCESS | 8065 | Values: 66.0 67.0 69.0 66.0 67.0 64.0 68.0 67.0 65.0 65.0 04:42:42 INFO - PROCESS | 8065 | -------- Summary: end -------- 04:42:42 INFO - PROCESS | 8065 | 04:42:43 INFO - TEST-INFO | 8065: exit 0 04:42:43 INFO - TEST-OK | kraken | took 59156ms 04:42:43 INFO - TEST-START | v8_7 04:42:43 INFO - operating with platform_type : linux_ 04:42:43 INFO - Initialising browser for v8_7 test... 04:42:43 INFO - TEST-INFO | started process 8359 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpx5lGAe/profile http://localhost:48320/getInfo.html) 04:42:46 INFO - PROCESS | 8359 | 04:42:46 INFO - PROCESS | 8359 | (process:8437): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:42:47 INFO - PROCESS | 8359 | __metrics Screen width/height:1600/1200 04:42:47 INFO - PROCESS | 8359 | colorDepth:24 04:42:47 INFO - PROCESS | 8359 | Browser inner width/height: 1024/697 04:42:47 INFO - PROCESS | 8359 | __metrics 04:42:48 INFO - TEST-INFO | 8359: exit 0 04:42:48 INFO - Browser initialized. 04:42:48 INFO - Running cycle 1/1 for v8_7 test... 04:42:48 INFO - TEST-INFO | started process 8486 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpx5lGAe/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:42:50 INFO - PROCESS | 8486 | 04:42:50 INFO - PROCESS | 8486 | (process:8548): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 04:43:00 INFO - PROCESS | 8486 | RSS: Main: 140963840 04:43:00 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | Cycle 1(1): loaded http://localhost:48320/tests/v8_7/run.html (next: http://localhost:48320/tests/v8_7/run.html) 04:43:23 INFO - PROCESS | 8486 | RSS: Main: 144801792 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | __start_tp_report 04:43:23 INFO - PROCESS | 8486 | _x_x_mozilla_page_load 04:43:23 INFO - PROCESS | 8486 | _x_x_mozilla_page_load_details 04:43:23 INFO - PROCESS | 8486 | |i|pagename|runs| 04:43:23 INFO - PROCESS | 8486 | |0;Richards;167.47613465081227 04:43:23 INFO - PROCESS | 8486 | |1;DeltaBlue;169.63528413910095 04:43:23 INFO - PROCESS | 8486 | |2;Encrypt;278.08676307007784 04:43:23 INFO - PROCESS | 8486 | |3;Decrypt;5208.333333333333 04:43:23 INFO - PROCESS | 8486 | |4;RayTrace;914.9130832570905 04:43:23 INFO - PROCESS | 8486 | |5;Earley;553.4034311012729 04:43:23 INFO - PROCESS | 8486 | |6;Boyer;11111.111111111111 04:43:23 INFO - PROCESS | 8486 | |7;RegExp;38773.58490566038 04:43:23 INFO - PROCESS | 8486 | |8;Splay;533.6156696664902 04:43:23 INFO - PROCESS | 8486 | |9;NavierStokes;4845.410628019324 04:43:23 INFO - PROCESS | 8486 | __end_tp_report 04:43:23 INFO - PROCESS | 8486 | __startTimestamp1456490603277__endTimestamp 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | ------- Summary: start ------- 04:43:23 INFO - PROCESS | 8486 | Number of tests: 10 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#0] Richards Cycles:1 Average:167.48 Median:167.48 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 167.5 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#1] DeltaBlue Cycles:1 Average:169.64 Median:169.64 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 169.6 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#2] Encrypt Cycles:1 Average:278.09 Median:278.09 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 278.1 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#3] Decrypt Cycles:1 Average:5208.33 Median:5208.33 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 5208.3 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#4] RayTrace Cycles:1 Average:914.91 Median:914.91 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 914.9 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#5] Earley Cycles:1 Average:553.40 Median:553.40 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 553.4 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#6] Boyer Cycles:1 Average:11111.11 Median:11111.11 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 11111.1 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#7] RegExp Cycles:1 Average:38773.58 Median:38773.58 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 38773.6 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#8] Splay Cycles:1 Average:533.62 Median:533.62 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 533.6 04:43:23 INFO - PROCESS | 8486 | 04:43:23 INFO - PROCESS | 8486 | [#9] NavierStokes Cycles:1 Average:4845.41 Median:4845.41 stddev:0.00 (0.0%) 04:43:23 INFO - PROCESS | 8486 | Values: 4845.4 04:43:23 INFO - PROCESS | 8486 | -------- Summary: end -------- 04:43:23 INFO - PROCESS | 8486 | 04:43:24 INFO - TEST-INFO | 8486: exit 0 04:43:24 INFO - TEST-OK | v8_7 | took 40773ms 04:43:24 INFO - SUITE-END | took 1208s 04:43:24 INFO - Completed test suite (00:20:08) 04:43:24 INFO - Working with test: dromaeo_css 04:43:24 INFO - Generating results file: dromaeo_css 04:43:24 INFO - Working with test: kraken 04:43:24 INFO - Generating results file: kraken 04:43:24 INFO - javascript benchmark 04:43:24 INFO - Working with test: v8_7 04:43:24 INFO - Generating results file: v8_7 04:43:24 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:43:24 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,52,43]] 04:43:24 INFO - process_Request line: dromaeo_css 7355.05 graph.html#tests=[[72,52,43]] 04:43:24 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:43:24 INFO - process_Request line: kraken 1489.30 graph.html#tests=[[232,52,43]] 04:43:24 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 04:43:24 INFO - process_Request line: v8_7 22052.11 graph.html#tests=[[230,52,43]] 04:43:24 INFO - RETURN: dromaeo_css: 7355.05 04:43:24 INFO - RETURN: kraken: 1489.30 04:43:24 INFO - RETURN: v8_7: 22052.11 04:43:24 INFO - javascript benchmark 04:43:24 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3301.6038075430943, 3317.751168662351, 3321.1697075731067, 3361.8487168077436, 3370.2922386298874, 5394.487523685249, 5411.675299482029, 5424.0779067558515, 5424.918626220609, 5443.727813609324, 5398.8920221595645, 5405.027095122877, 5406.08096623574, 5431.293931788862, 5453.454654534545, 4937.753112344386, 4975.402951645808, 5058.4435712071645, 5087.56755675768, 5125.231215317714, 4797.448293446246, 4892.804287828482, 4960.67755595887, 4961.801527938878, 5003.0, 4965.801367945278, 5025.773840177182, 5031.748412579356, 5040.1935690289565, 5040.445550989388, 5031.4465408805, 5034.848954531333, 5051.772670229849, 5070.416902056237, 5092.0, 4793.784279707422, 4862.294967229732, 4896.314515967767, 4959.270250353521, 4972.0, 5209.817656382009, 5278.340207474066, 5280.841574752763, 5284.550813180885, 5333.306670132858, 5771.624844385144, 5798.739056742456, 5800.419958004208, 5830.096335068071, 5830.125481177814, 5638.802641907513, 5742.253507044099, 5781.335146458169, 5849.707514624294, 5860.267466566679, 5548.056830338812, 5551.8889622207735, 5553.972230138864, 5557.833265002057, 5561.971035358471, 5962.821115366546, 6016.308124565643, 6029.306629737636, 6032.245969253843, 6044.03295472731, 5544.445555444423, 5642.040853054908, 5743.6266642668925, 5779.219805326227, 5802.129680547867, 5780.826575202751, 5792.420757924258, 5816.796412125555, 5824.737886795105, 5840.912386314209, 5729.083346664597, 5763.7982670606325, 5768.1636162757, 5768.596198266081, 5779.075347944393, 5644.153376993484, 5702.230198923092, 5729.627574207663, 5776.595638305278, 5858.472737453564, 4469.664775141812, 4479.888002799956, 4483.327500874895, 4496.820127194941, 4497.010657655311, 4023.1551374211745, 4023.4568333274633, 4025.6376926076796, 4047.3321901886447, 4063.1061166543313, 5382.138857782736, 5461.890762184734, 5535.750891209906, 5604.579656525695, 5674.347450043298, 5787.681677507778, 5804.9419505805245, 5806.941930580725, 5807.0998995155815, 5809.82570522885, 5393.4336894626285, 5512.862178445491, 5519.31008623922, 5530.198121272393, 5534.059209934321, 4964.032013757354, 5066.544011038951, 5106.642535022587, 5132.127538318495, 5141.897162056738, 5891.1457838614015, 5925.525957923356, 5975.312839023481, 5983.970080149571, 5991.101334799815, 5668.603197776116, 5795.913061304168, 5821.767129314865, 5828.329742079545, 5831.591788574759, 5794.0, 5813.04084825999, 6034.577579569388, 6088.573799833969, 6144.56988010835, 5825.563082768725, 5848.53211743051, 5854.180414742024, 5868.0, 5888.970555147197, 5677.716114194356, 5904.350521442552, 5932.228810254639, 5960.314563825215, 5964.671943043, 5583.190437386637, 5712.257406537124, 5788.102844059177, 5792.189093526826, 5818.563607729353, 5677.1768093627015, 5690.630109042899, 5695.7436915338085, 5698.088305871041, 5700.144978253129, 5615.943840561542, 5618.297712785902, 5620.072688006433, 5621.184928185472, 5635.661860288232, 5560.63891154302, 5574.470425309589, 5622.7469763861545, 5756.740946657326, 5802.506786923159, 5563.499285064202, 5594.356648985256, 5603.467670571289, 5622.24099746529, 5634.408387119457], "unit": "score", "name": "dojo.html", "value": 5381.266222223269}, {"lowerIsBetter": false, "replicates": [557.7148969086933, 572.9026065568853, 584.0771580902175, 592.1325258496302, 634.4543692424511, 38669.0, 39095.41356879649, 39316.21367572647, 39410.80294598526, 39634.8018259909, 42188.0, 42769.572304276946, 42800.35799463003, 42823.35764963528, 42835.14329713412, 8853.955730221356, 9003.054679258648, 9028.77428064297, 9061.275097992178, 9092.818143637123, 8751.956240218822, 8867.73396798097, 8901.465912045265, 9052.456852588833, 9091.363604547685, 9074.77313067172, 9158.679446219383, 9161.633534658638, 9178.632854685804, 9210.217131543826, 9042.502662353569, 9145.268378529769, 9152.0, 9156.633734650606, 9179.632814687404, 8815.0, 8819.955900220522, 8931.955340223321, 9109.81780364389, 9134.862977055349, 43273.0, 43834.12331753379, 43897.561024389666, 43928.12143757139, 44158.77920610408, 3576.7138628909624, 3652.8721494747556, 3693.741438099334, 3764.7552909060823, 3959.2675355059405, 32690.673093269, 32729.509057364157, 32750.672493275, 32807.50788738171, 33196.3360732784, 4319.546447622985, 4335.653147748204, 4368.104538569585, 4388.27593447084, 4434.689571729948, 297205.0, 298213.0, 298904.0, 300466.0, 332298.0, 65173.0, 65646.67176664181, 65788.67105664537, 66178.66910665415, 66395.0, 70597.64701176564, 71278.64360678164, 71382.28617713756, 71404.2859571408, 71457.0, 16532.586685332964, 16567.42014029503, 16711.83288167127, 16723.83276167247, 16757.65938724899, 11994.700132496582, 12051.457684404222, 12074.396280185956, 12080.879191207976, 12088.456019479145, 22171.334859954226, 22298.331050068526, 22331.21840735599, 22375.44061398478, 22377.32868013962, 8705.6517739291, 8824.205821476098, 8833.586626139786, 8908.242799361997, 9048.864267036, 1069.4118234970736, 1134.6425875849081, 1141.8743938166795, 1153.7346410325504, 1224.871388504212, 30513.086613469684, 30713.84643076815, 30736.385272294876, 30864.69135308663, 31064.0, 1137.1528211482498, 1160.1356989043218, 1202.5550546297925, 1221.1940119521073, 1232.3406977267118, 14652.633684157981, 14678.266086695623, 14925.029873058216, 15266.236688165547, 15321.387144514318, 422823.0, 531553.0, 562087.0, 566239.0, 568563.0, 54226.45773542293, 55213.0, 55232.0, 55257.0, 55524.16713749297, 1453.6656568989192, 1489.8957073005001, 1499.235389951111, 1506.1565523306983, 1507.0505581483594, 31797.841010794797, 31892.521612175373, 32616.184595385304, 33434.33131337408, 33996.66003340034, 49812.0, 50389.74805125951, 50417.0, 50443.747781260856, 50622.74688626533, 313645.0, 319073.0, 319159.0, 319404.0, 320224.0, 45891.54108459006, 45906.0, 45971.3104303429, 46679.766601166775, 47039.294410583185, 48457.75771121263, 50368.24447633362, 50555.74722126366, 51563.22655160101, 52226.21660675017, 38216.42675359928, 39189.41215881707, 39803.40294895637, 40319.1936161281, 40480.797596011835, 38696.226075478895, 39182.0, 39332.80333598314, 41440.171196576506, 43894.34158487561, 37076.07309817276, 37565.0, 37854.62145378511, 37867.81066094652, 38066.238675226894, 32596.185095372806, 32757.181070473427, 32923.835380822944, 33043.83478082594, 33176.0, 26187.869060654575, 26605.86697066502, 26744.46511069729, 28528.521037164945, 29855.402891942475], "unit": "score", "name": "ext.html", "value": 20426.648338820254}, {"lowerIsBetter": false, "replicates": [395.57278139609224, 396.6291517431203, 400.3554277613043, 400.5053758608117, 403.91517781265935, 14882.330295136719, 15528.767068493982, 17439.389621363254, 17890.194941227644, 17919.46241612754, 10964.725881852957, 11566.363849988269, 15065.62335941602, 18154.909225453855, 18381.172847221875, 5119.7184154871375, 5359.812406565771, 5640.097584386499, 5651.378348381675, 5658.519025882805, 5256.159014557672, 5434.7826086956475, 5467.043267428204, 5583.246261754652, 5650.6892120933335, 5263.0, 5426.810061647843, 5453.2092846537225, 5466.453354664522, 5499.450054994509, 5628.549716022709, 5632.690202038886, 5668.206451096849, 5677.772889084432, 5698.259226300595, 5421.620486565942, 5625.46558076982, 5657.1514272858985, 5662.518685911702, 5663.405342439067, 14199.36102875373, 18131.002794846278, 21537.030833612524, 21972.0, 22193.55612887733, 2234.7765223477686, 2357.210334537932, 2402.9519409611885, 2435.232901635979, 2493.9376515587073, 10213.897861021369, 10218.0, 10248.180145588334, 10303.227257955683, 10572.15422766177, 1800.5228614417058, 1853.3142737187327, 1904.1621686457913, 1954.3843689237845, 1966.301962803213, 60574.39425605732, 62148.37851621516, 64197.358026419606, 64309.3569064308, 64430.67784661094, 10901.945490272656, 11102.389368584643, 11146.777064458827, 11171.0, 11198.328100314007, 14730.55808325752, 14791.778123328158, 14828.110313381232, 14889.553313400615, 14899.329530171168, 7893.0, 8015.559144247122, 8032.879506807402, 8052.637631306605, 8100.554469504234, 7405.7778266652085, 7413.1104267488245, 7456.85086298271, 7463.626818659045, 7484.962575187089, 4644.744539050384, 4795.976020119877, 4824.903501930012, 4834.323194752737, 4883.8290659826735, 1921.807819218067, 2028.3712049264775, 2035.908384122718, 2047.3346162497248, 2048.6107639548436, 994.7562847102506, 1001.5042553935702, 1026.2559644257854, 1033.4109557552124, 1047.4919663962971, 16906.830931690525, 17203.65592688139, 17498.641487235007, 17590.208440619946, 17826.48474879624, 910.8542633178793, 960.9759756006156, 976.1848856205006, 995.9053889880595, 1052.4001319247955, 9278.768030799283, 9320.347575669774, 9417.387869788441, 9845.113939745457, 9929.92693449047, 439281.0, 443750.0, 444543.0, 641205.0, 654738.726306375, 49130.75434622804, 49188.0, 49968.0, 74441.62779186177, 77699.61150194213, 1122.354646078508, 1147.2313549921573, 1167.5796713183247, 1201.507381973404, 1208.4863932828512, 16230.756538652166, 16274.593135171242, 16578.336866525206, 16768.664626707152, 16928.49214523566, 31638.0, 32545.349093017532, 32642.0, 32921.83539082289, 33801.323973520884, 40088.59911400849, 40899.7955010223, 41545.79227103966, 43769.12461750811, 43769.78115109404, 3172.27037781307, 4174.519930207944, 5699.430056994267, 7393.0, 8119.878201827096, 3602.0274525877344, 3660.652238037382, 4305.418768466342, 10903.509342079467, 11175.944120279672, 10028.29801913859, 10733.570657173626, 10759.0, 10760.946195268974, 10900.727481813017, 9512.09635084666, 9814.558344874355, 10045.397276163454, 10246.590136394461, 10791.892081079088, 9833.16418104469, 10376.844347334947, 10399.0, 10454.581816727246, 10797.514111864828, 7712.0, 8193.631286591999, 8285.4200205985, 8348.749537513884, 8375.329973601976, 8296.958515207385, 10316.27786054969, 10491.527881245209, 10609.045185933302, 10764.300320479144], "unit": "score", "name": "jquery.html", "value": 8330.294333112139}, {"lowerIsBetter": false, "replicates": [1584.2791529853919, 1603.366670165285, 1840.4386662068064, 1900.44886982775, 1930.3629802165296, 7326.890096648554, 7452.217517160701, 8107.270345668889, 8298.5435801031, 8299.419040667148, 7759.534427934328, 7821.452498325119, 7880.881786773203, 7917.604119794016, 7978.640961156747, 2389.06826337728, 2419.9957017837664, 2421.87890605469, 2425.333033415816, 2429.380507970474, 2419.250032489925, 2450.4608986023136, 2455.7667021632915, 2488.7884529814896, 2496.8002559795264, 2324.23300310897, 2332.055517515409, 2395.880205989702, 2424.1151979527435, 2440.987795061022, 2406.097713357491, 2407.518496300738, 2412.3004328744732, 2435.512897420523, 2473.75262473753, 2332.7084114485688, 2338.216697406354, 2339.146211632759, 2342.472943587696, 2364.574376612209, 8357.83284334316, 8388.32893368529, 8439.789005274855, 8451.0, 8468.83062338756, 5071.7210553419545, 5156.510131537498, 5161.767720452551, 5163.845084647466, 5176.275321454999, 3099.070278916339, 3114.314850732835, 3181.459151944175, 3226.354729054175, 3278.37710834943, 1086.7120213143523, 1089.1014912696978, 1099.796537640539, 1109.0850048709847, 1112.2040919224353, 11475.0, 11480.196386252966, 11502.597409090726, 11510.251833630788, 11541.192116551845, 4760.833370832004, 4776.307435421844, 4778.402699662543, 4815.662903596714, 4842.709437433765, 9710.077542633438, 9728.124468797841, 9735.464549449849, 9755.9024409755, 9789.657361992438, 5031.345925029796, 5040.747962601855, 5066.721330326867, 5069.949300506948, 5074.898502029939, 4515.525869783691, 4666.836660716926, 4696.225122854691, 4760.214564596803, 4790.401199850019, 3866.613338666111, 3901.843926242975, 3910.6089391061237, 3956.940645890314, 3977.880663580097, 1184.1710802438329, 1189.2151180221013, 1201.141184053406, 1205.054032584417, 1236.6537369536545, 1128.3342827731678, 1128.9604863829727, 1147.822087576427, 1384.2940100548792, 1451.8765904898203, 7759.068911730628, 7770.844583108419, 7778.377729781604, 7800.375969922393, 7982.640781164861, 1184.1829137894824, 1190.7380376317196, 1210.2496452199694, 1218.1229514749366, 1224.0391292835081, 6120.632762034292, 6139.3553676863285, 6182.567220294626, 6196.318404975449, 6224.813255602339, 9866.062724041205, 10190.133838623651, 10196.643117490852, 10240.897591024144, 10309.587616495406, 10044.698659040241, 10084.949575252223, 10242.129418999319, 10288.228382871164, 10313.84529232062, 7858.528488290721, 7964.522128672298, 7984.481008734414, 7996.440249182501, 8021.919780802117, 7586.24137586237, 7642.04474440695, 7648.694052237848, 7684.3084122429245, 7696.037995250594, 8769.91230087691, 9078.319126065704, 9123.908760912305, 9140.497272650067, 9154.633814647339, 9165.350236957145, 9254.537273136451, 9255.167034966886, 9446.24430045581, 9491.098345657152, 7043.577385356895, 7168.641567921479, 7239.638018099179, 7406.740764073232, 7416.48084634092, 7893.052833659768, 7904.84190316202, 7908.4464087513325, 7931.841363172589, 7950.642221099949, 7329.596872172082, 7461.253874612496, 7560.508566943131, 7562.697492100475, 7633.618319084135, 7298.781036568911, 7330.633468326669, 7333.413326933725, 7398.9630051851545, 7576.128745194374, 7581.924180758342, 7609.88585171234, 7632.847343052997, 7661.770146895602, 7716.884246736416, 6788.083608712958, 6847.863042739018, 6901.413379862768, 6931.6880740367815, 6942.236354000955, 7062.364387205176, 7081.82295442618, 7081.858362832818, 7114.21743608213, 7128.607926563881], "unit": "score", "name": "mootools.html", "value": 4814.4667996064845}, {"lowerIsBetter": false, "replicates": [361.7702758748194, 362.213995629484, 368.1991668121834, 375.64313901793304, 377.1890435563538, 6275.403836635513, 6335.5565110442285, 6467.417932386084, 6473.611583304999, 6480.935190648092, 6167.167432396625, 6315.715792789324, 6351.856665800154, 6360.840978975528, 6399.424051835334, 4925.162722337193, 4936.481669424695, 4942.530459606341, 4945.579625731799, 4948.8267910623135, 4921.18800397934, 4921.8277360292395, 4923.089228492722, 4927.113119638464, 4957.3059771632, 4695.60087392572, 4858.951410485885, 4864.975675121619, 4868.975655121737, 4869.464358920516, 4838.153323168432, 4847.2002119650215, 4850.854474365757, 4857.222844344923, 4858.708477491362, 4223.408722778782, 4226.218149642326, 4231.576842315744, 4238.978805105955, 4243.384709217177, 5975.940240597582, 6065.514758819284, 6084.665343406111, 6099.817005489843, 6105.572609917308, 5613.46672066153, 5643.181738647914, 5653.208550802891, 5659.122835960392, 5673.26247587815, 6709.966450167718, 6710.3625155610625, 6758.290379510179, 6771.356721111487, 6785.72857085716, 4639.280911458729, 4672.018876036036, 4673.5793778559755, 4680.485146633868, 4700.576948074689, 6911.2397636259975, 7061.082059332254, 7098.39663628587, 7125.465590080765, 7125.5368401053765, 4799.520047995243, 4804.0, 4806.0, 4810.518948105161, 4813.253945638432, 4865.5864251538305, 4867.440244371872, 4880.682755620945, 4880.731559764247, 4887.120318342661, 5473.28847249863, 5614.382417934024, 5629.634073785191, 5638.379778224392, 5654.858628534237, 6822.044913712084, 6867.07294515234, 6870.553414028072, 6877.140357455318, 6883.965580172067, 1642.852143307108, 1668.7580300856307, 1679.6808606364752, 1691.687037897993, 1693.796744390681, 1138.0838425067734, 1148.9770204595861, 1149.6780901347636, 1150.1431433582036, 1159.7796418680423, 6430.3891130342545, 6506.284308726036, 6544.247411547733, 6544.44372228366, 6569.737210511622, 6930.8613827724175, 6959.09531760878, 6960.756373526902, 6974.651267436608, 6975.965120174366, 6493.383128602775, 6522.282548919615, 6534.607923524603, 6535.640539770263, 6538.444232240217, 3828.6362795534938, 3830.693544516432, 3831.3295173344554, 3856.749311294757, 3857.7685338879196, 7336.339729424378, 7365.447591430664, 7382.077240344957, 7391.15001774792, 7408.296211859864, 7102.289771022856, 7197.100362454693, 7234.674439650228, 7274.672639731225, 7296.124465064227, 7236.819079523054, 7306.926930730625, 7315.926840731525, 7347.338739513362, 7362.484626076231, 7042.471814613822, 7068.858622827412, 7075.893861591977, 7114.608696521534, 7138.85722285541, 6771.932280677327, 6977.33715297046, 6996.370326670624, 7008.719651213894, 7034.5427547209265, 7311.780646580611, 7316.1952185258515, 7316.707331706672, 7334.743283985035, 7334.963325183553, 4920.0, 4942.604591632733, 4953.702777833341, 4961.603071754179, 4969.726665033313, 6928.688209030505, 6989.091418115612, 7052.682629281592, 7120.359167674934, 7122.643867806485, 6950.54821436605, 6954.860902782018, 6977.965110174417, 6989.37095661393, 7001.754938577125, 6874.0, 6892.793216203522, 6894.172699276119, 6894.689738961659, 6896.655167241718, 6626.933730662631, 6746.257911629618, 6773.89839152423, 6798.796036118924, 6806.8638627228165, 6941.687624056828, 6967.756128535477, 6968.163820341591, 6984.860302794017, 6986.231514533499, 6696.0, 6749.291324410866, 6761.86476270462, 6766.086578311865, 6770.796876093725], "unit": "score", "name": "prototype.html", "value": 5145.244701626657}, {"lowerIsBetter": false, "replicates": [926.9861499706273, 932.6269492203118, 936.8735220745198, 940.6848705683597, 959.7312752429323, 13483.662908427294, 13557.0, 14538.41846326147, 14602.415903363866, 15002.324895379707, 14197.290135493236, 14288.0, 14305.213213273291, 14308.069975451588, 14380.784288235685, 875.3653601139155, 881.7178502879066, 889.4974339498195, 892.3530440430701, 896.3008853094597, 880.9867851982225, 896.4755617963499, 896.4979611417594, 900.0324651000201, 901.4140808474511, 918.191991047877, 922.0687106022932, 922.6217250927122, 924.2744445610198, 927.4481683398367, 904.3036861616584, 904.9185573298435, 913.6025828764475, 915.839728047589, 917.2341095185461, 686.8626274745021, 689.7965100295424, 696.6377483708494, 698.3575110897985, 699.3076853914639, 15610.765838512318, 15632.452864149815, 15680.451184208612, 15699.607509812231, 15783.605409864731, 13975.440982360693, 14011.08927919682, 14019.0, 14123.717525649532, 14135.71728565423, 11344.43277836105, 11377.488013039432, 11402.714932126763, 11442.828357574643, 11561.942190289079, 4518.597826949, 4575.450945886481, 4596.448426188846, 4617.630589552861, 4620.537946205386, 50734.746326268134, 50920.490795092315, 50957.235641465406, 50978.0, 51054.74472627688, 10755.731106722238, 11168.441577921072, 11201.495932683049, 11271.661850144508, 11461.713457163638, 19020.144093515824, 19197.32809351666, 19236.422907312804, 19274.8072519273, 19345.806541934402, 7868.685252589832, 7955.84088318242, 8157.592120393957, 8232.958835205785, 8315.708950186836, 4426.667999900021, 4434.312681534368, 4448.199324121689, 4451.087527056946, 4522.683412161117, 3148.7481001519823, 3151.5745374374624, 3165.3036332006923, 3177.5551422800827, 3179.8092114473206, 622.9377062293825, 630.9621422714652, 631.1542533005703, 631.7757196195377, 640.6252342379667, 719.463999320499, 738.4240292571695, 743.2047708951478, 755.4824944912752, 772.9690812367443, 10446.320989135682, 10449.425281609585, 10661.09380702649, 10821.513031913582, 10952.233343665866, 630.3286999345682, 706.1914108346018, 721.841194937113, 729.4310437858479, 747.517850986111, 4507.909841803145, 4716.056788642285, 4828.758562071883, 4895.192293271571, 4943.530364615356, 61121.38878611246, 61895.38104618986, 62256.377436225965, 62477.687611561654, 63082.68458657769, 51752.74123629358, 52863.0, 55159.44840551543, 55678.72160639252, 55711.0, 47341.28988065182, 49700.50299497031, 50395.49604503908, 50586.747066264434, 51381.743091285054, 9800.607975680892, 9956.950215248877, 9972.30193886421, 10053.246006549392, 10097.848532271875, 37058.629413705516, 37671.24657506889, 38108.04729881775, 38357.04107397337, 38509.037274068374, 44154.0, 44696.0, 48636.75681621711, 48935.0, 49104.2634360492, 11841.82237266459, 11867.881321186678, 12005.579804706793, 12046.698832528906, 12314.75370492603, 12751.426185821845, 12809.103362764517, 12819.038572106943, 13063.150895191782, 13844.10013349129, 12228.44971976281, 12717.745645087232, 12912.096153269182, 13013.934930325666, 13612.93193534026, 11704.94147529257, 11826.586069487526, 11931.880681193077, 12034.63896083119, 12076.0, 12762.0, 12762.106652534234, 13067.085304028627, 13286.800697989345, 13309.267990260629, 10102.292839501459, 10332.948335258276, 10359.171266298828, 10580.576776929145, 10649.414282214553, 10934.617288394868, 11034.668959931216, 11093.611723589636, 11106.167037472384, 11191.44042797873], "unit": "score", "name": "yui.html", "value": 6978.79076201213}], "name": "dromaeo_css", "value": 7355.047799098307}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 106.0, 113.0, 110.0, 110.0, 120.0, 109.0, 110.0, 111.0, 112.0], "unit": "score", "name": "ai-astar", "value": 111.3}, {"lowerIsBetter": true, "replicates": [149.0, 125.0, 149.0, 161.0, 128.0, 157.0, 152.0, 125.0, 166.0, 129.0], "unit": "score", "name": "audio-beat-detection", "value": 144.1}, {"lowerIsBetter": true, "replicates": [163.0, 161.0, 162.0, 162.0, 161.0, 162.0, 162.0, 163.0, 165.0, 163.0], "unit": "score", "name": "audio-dft", "value": 162.4}, {"lowerIsBetter": true, "replicates": [77.0, 75.0, 75.0, 143.0, 75.0, 75.0, 75.0, 74.0, 155.0, 74.0], "unit": "score", "name": "audio-fft", "value": 89.8}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 151.0, 94.0, 95.0, 96.0, 142.0, 95.0, 96.0, 134.0], "unit": "score", "name": "audio-oscillator", "value": 109.5}, {"lowerIsBetter": true, "replicates": [110.0, 110.0, 109.0, 109.0, 110.0, 111.0, 110.0, 110.0, 109.0, 111.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.9}, {"lowerIsBetter": true, "replicates": [147.0, 147.0, 147.0, 147.0, 146.0, 147.0, 148.0, 147.0, 148.0, 147.0], "unit": "score", "name": "imaging-darkroom", "value": 147.1}, {"lowerIsBetter": true, "replicates": [97.0, 96.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0, 96.0, 97.0], "unit": "score", "name": "imaging-desaturate", "value": 96.3}, {"lowerIsBetter": true, "replicates": [55.0, 60.0, 55.0, 56.0, 56.0, 55.0, 62.0, 63.0, 54.0, 55.0], "unit": "score", "name": "json-parse-financial", "value": 57.1}, {"lowerIsBetter": true, "replicates": [63.0, 64.0, 64.0, 64.0, 64.0, 64.0, 65.0, 65.0, 64.0, 66.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.3}, {"lowerIsBetter": true, "replicates": [78.0, 78.0, 80.0, 80.0, 79.0, 80.0, 81.0, 80.0, 79.0, 82.0], "unit": "score", "name": "stanford-crypto-aes", "value": 79.7}, {"lowerIsBetter": true, "replicates": [126.0, 113.0, 126.0, 117.0, 110.0, 114.0, 112.0, 112.0, 112.0, 112.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 115.4}, {"lowerIsBetter": true, "replicates": [127.0, 145.0, 136.0, 142.0, 139.0, 140.0, 128.0, 137.0, 130.0, 136.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 136.0}, {"lowerIsBetter": true, "replicates": [66.0, 67.0, 69.0, 66.0, 67.0, 64.0, 68.0, 67.0, 65.0, 65.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.4}], "name": "kraken", "value": 1489.3}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.47613465081227], "unit": "score", "name": "Richards", "value": 210.7882419999999}, {"lowerIsBetter": false, "replicates": [169.63528413910095], "unit": "score", "name": "DeltaBlue", "value": 389.76561000000004}, {"lowerIsBetter": false, "replicates": [278.08676307007784], "unit": "score", "name": "Encrypt", "value": 957.1868759999999}, {"lowerIsBetter": false, "replicates": [5208.333333333333], "unit": "score", "name": "Decrypt", "value": 51.10675199999996}, {"lowerIsBetter": false, "replicates": [914.9130832570905], "unit": "score", "name": "RayTrace", "value": 808.807977}, {"lowerIsBetter": false, "replicates": [553.4034311012729], "unit": "score", "name": "Earley", "value": 1204.2986409999994}, {"lowerIsBetter": false, "replicates": [11111.111111111111], "unit": "score", "name": "Boyer", "value": 59.98166999999996}, {"lowerIsBetter": false, "replicates": [38773.58490566038], "unit": "score", "name": "RegExp", "value": 23.494990267639917}, {"lowerIsBetter": false, "replicates": [533.6156696664902], "unit": "score", "name": "Splay", "value": 152.71478075396828}, {"lowerIsBetter": false, "replicates": [4845.410628019324], "unit": "score", "name": "NavierStokes", "value": 306.26919242273203}], "name": "v8_7", "value": 22052.10673710957}]} 04:43:24 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,43]]", "result": "22052.11"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,43]]", "result": "1489.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,43]]", "result": "7355.05"}}} 04:43:24 INFO - Return code: 0 04:43:24 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 04:43:24 INFO - # TBPL SUCCESS # 04:43:24 INFO - Running post-action listener: _resource_record_post_action 04:43:24 INFO - Running post-run listener: _resource_record_post_run 04:43:25 INFO - Total resource usage - Wall time: 1225s; CPU: 13.0%; Read bytes: 20480; Write bytes: 273383424; Read time: 180; Write time: 208088 04:43:25 INFO - install - Wall time: 15s; CPU: 13.0%; Read bytes: 0; Write bytes: 19902464; Read time: 0; Write time: 29344 04:43:25 INFO - run-tests - Wall time: 1210s; CPU: 13.0%; Read bytes: 20480; Write bytes: 253480960; Read time: 180; Write time: 178744 04:43:25 INFO - Running post-run listener: _upload_blobber_files 04:43:25 INFO - Blob upload gear active. 04:43:25 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 04:43:25 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 04:43:25 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test-pgo/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 04:43:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test-pgo/oauth.txt -b Mozilla-Aurora -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 04:43:26 INFO - (blobuploader) - INFO - Open directory for files ... 04:43:26 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:43:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:43:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:43:26 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:43:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:43:26 INFO - (blobuploader) - INFO - Done attempting. 04:43:26 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:43:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:43:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:43:27 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:43:27 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:43:27 INFO - (blobuploader) - INFO - Done attempting. 04:43:27 INFO - (blobuploader) - INFO - Iteration through files over. 04:43:27 INFO - Return code: 0 04:43:27 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 04:43:27 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 04:43:27 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/61bf9c21276daba63282ec582c3def85d407ce75f3e1c2826ce321fd0525eda87f95c4892e73d659adceddfd3b1b9a6c19feb0d3bdb7d2508da3d9d8dc5488ec", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6f18f16057f958e59a98582afa1ebd5c4d64a2e3fdd6718254783c34d1831bda889623bc7ed32645b30f5c66014d501b0e4b3257dc332f88a12f3826eace5287"} 04:43:27 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 04:43:27 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 04:43:27 INFO - Contents: 04:43:27 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/61bf9c21276daba63282ec582c3def85d407ce75f3e1c2826ce321fd0525eda87f95c4892e73d659adceddfd3b1b9a6c19feb0d3bdb7d2508da3d9d8dc5488ec", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6f18f16057f958e59a98582afa1ebd5c4d64a2e3fdd6718254783c34d1831bda889623bc7ed32645b30f5c66014d501b0e4b3257dc332f88a12f3826eace5287"} 04:43:27 INFO - Running post-run listener: copy_logs_to_upload_dir 04:43:27 INFO - Copying logs to upload dir... 04:43:27 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 04:43:27 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1289.657913 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 29 secs) (at 2016-02-26 04:43:26.932830) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-26 04:43:26.936106) ========= 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=cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084 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/Mozilla-Aurora/sha512/61bf9c21276daba63282ec582c3def85d407ce75f3e1c2826ce321fd0525eda87f95c4892e73d659adceddfd3b1b9a6c19feb0d3bdb7d2508da3d9d8dc5488ec", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6f18f16057f958e59a98582afa1ebd5c4d64a2e3fdd6718254783c34d1831bda889623bc7ed32645b30f5c66014d501b0e4b3257dc332f88a12f3826eace5287"} build_url:https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011431 build_url: 'https://queue.taskcluster.net/v1/task/MMizcejaRk2yJYPlRa9cLQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/61bf9c21276daba63282ec582c3def85d407ce75f3e1c2826ce321fd0525eda87f95c4892e73d659adceddfd3b1b9a6c19feb0d3bdb7d2508da3d9d8dc5488ec", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/6f18f16057f958e59a98582afa1ebd5c4d64a2e3fdd6718254783c34d1831bda889623bc7ed32645b30f5c66014d501b0e4b3257dc332f88a12f3826eace5287"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-02-26 04:43:26.964774) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:43:26.965120) ========= 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=cbe409c6de289db6ac707de3000001d4-1456485602.713597-1186083084 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004490 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-02-26 04:43:27.049703) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-26 04:43:27.050502) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-02-26 04:43:27.051384) ========= ========= Total master_lag: 0.33 =========