builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-002 starttime: 1456917618.33 results: success (0) buildid: 20160302004006 builduid: 81e6379447cc417f839a8d9ba1c2da28 revision: d755e1b8c8f062020a85166235fe05dd88bb6feb ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.330506) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.331093) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.331396) ========= 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=a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006353 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.354457) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.354778) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.374982) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.375378) ========= 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=a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022251 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.431553) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.431839) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.432190) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.432466) ========= 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=a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-03-02 03:20:18-- 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% 39.9M=0s 2016-03-02 03:20:18 (39.9 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.093971 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.543363) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.543657) ========= 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=a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.053201 ========= master_lag: 0.01 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.609427) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:18.609771) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev d755e1b8c8f062020a85166235fe05dd88bb6feb --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 d755e1b8c8f062020a85166235fe05dd88bb6feb --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=a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-03-02 03:20:18,834 truncating revision to first 12 chars 2016-03-02 03:20:18,834 Setting DEBUG logging. 2016-03-02 03:20:18,834 attempt 1/10 2016-03-02 03:20:18,834 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/d755e1b8c8f0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-03-02 03:20:19,083 unpacking tar archive at: mozilla-aurora-d755e1b8c8f0/testing/mozharness/ program finished with exit code 0 elapsedTime=0.561167 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:19.184183) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:19.185202) ========= echo d755e1b8c8f062020a85166235fe05dd88bb6feb in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'd755e1b8c8f062020a85166235fe05dd88bb6feb'] 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=a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False d755e1b8c8f062020a85166235fe05dd88bb6feb program finished with exit code 0 elapsedTime=0.004674 script_repo_revision: 'd755e1b8c8f062020a85166235fe05dd88bb6feb' ========= master_lag: 0.05 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:19.235805) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:19.236089) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-03-02 03:20:19.266327) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 19 secs) (at 2016-03-02 03:20:19.266608) ========= /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=a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:20:19 INFO - MultiFileLogger online at 20160302 03:20:19 in /builds/slave/test-pgo 03:20:19 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 03:20:19 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 03:20:19 INFO - {'append_to_log': False, 03:20:19 INFO - 'base_work_dir': '/builds/slave/test-pgo', 03:20:19 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 03:20:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 03:20:19 INFO - 'branch': 'Mozilla-Aurora', 03:20:19 INFO - 'buildbot_json_path': 'buildprops.json', 03:20:19 INFO - 'config_files': ('talos/linux_config.py',), 03:20:19 INFO - 'default_actions': ('clobber', 03:20:19 INFO - 'read-buildbot-config', 03:20:19 INFO - 'download-and-extract', 03:20:19 INFO - 'populate-webroot', 03:20:19 INFO - 'create-virtualenv', 03:20:19 INFO - 'install', 03:20:19 INFO - 'run-tests'), 03:20:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:20:19 INFO - 'download_minidump_stackwalk': True, 03:20:19 INFO - 'download_symbols': 'ondemand', 03:20:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:20:19 INFO - 'tooltool.py': '/tools/tooltool.py', 03:20:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:20:19 INFO - '/tools/misc-python/virtualenv.py')}, 03:20:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:20:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:20:19 INFO - 'installer_path': 'installer.exe', 03:20:19 INFO - 'log_level': 'info', 03:20:19 INFO - 'log_name': 'talos', 03:20:19 INFO - 'log_to_console': True, 03:20:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:20:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:20:19 INFO - 'opt_config_files': (), 03:20:19 INFO - 'pip_index': False, 03:20:19 INFO - 'sps_profile': False, 03:20:19 INFO - 'sps_profile_interval': 0, 03:20:19 INFO - 'suite': 'dromaeojs-e10s', 03:20:19 INFO - 'system_bits': '32', 03:20:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:20:19 INFO - 'title': 'talos-linux64-ix-002', 03:20:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:20:19 INFO - 'use_talos_json': True, 03:20:19 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 03:20:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:20:19 INFO - 'work_dir': 'build'} 03:20:19 INFO - ##### 03:20:19 INFO - ##### Running clobber step. 03:20:19 INFO - ##### 03:20:19 INFO - Running pre-action listener: _resource_record_pre_action 03:20:19 INFO - Running main action method: clobber 03:20:19 INFO - rmtree: /builds/slave/test-pgo/build 03:20:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 03:20:24 INFO - Running post-action listener: _resource_record_post_action 03:20:24 INFO - ##### 03:20:24 INFO - ##### Running read-buildbot-config step. 03:20:24 INFO - ##### 03:20:24 INFO - Running pre-action listener: _resource_record_pre_action 03:20:24 INFO - Running main action method: read_buildbot_config 03:20:24 INFO - Using buildbot properties: 03:20:24 INFO - { 03:20:24 INFO - "project": "", 03:20:24 INFO - "product": "firefox", 03:20:24 INFO - "script_repo_revision": "production", 03:20:24 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 03:20:24 INFO - "repository": "", 03:20:24 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 03:20:24 INFO - "buildid": "20160302004006", 03:20:24 INFO - "stage_platform": "linux64-pgo", 03:20:24 INFO - "basedir": "/builds/slave/test-pgo", 03:20:24 INFO - "nightly_build": "True", 03:20:24 INFO - "buildnumber": 195, 03:20:24 INFO - "slavename": "talos-linux64-ix-002", 03:20:24 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 03:20:24 INFO - "platform": "ubuntu64_hw", 03:20:24 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 03:20:24 INFO - "branch": "mozilla-aurora", 03:20:24 INFO - "repo_path": "releases/mozilla-aurora", 03:20:24 INFO - "revision": "d755e1b8c8f062020a85166235fe05dd88bb6feb", 03:20:24 INFO - "pgo_build": "True", 03:20:24 INFO - "builduid": "81e6379447cc417f839a8d9ba1c2da28", 03:20:24 INFO - "slavebuilddir": "test" 03:20:24 INFO - } 03:20:24 INFO - Found installer url https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2. 03:20:24 INFO - Running post-action listener: _resource_record_post_action 03:20:24 INFO - ##### 03:20:24 INFO - ##### Running download-and-extract step. 03:20:24 INFO - ##### 03:20:24 INFO - Running pre-action listener: _resource_record_pre_action 03:20:24 INFO - Running main action method: download_and_extract 03:20:24 INFO - mkdir: /builds/slave/test-pgo/build/tests 03:20:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:20:24 INFO - https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 03:20:24 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/test_packages.json 03:20:24 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/test_packages.json 03:20:24 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 03:20:24 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 03:20:25 INFO - Downloaded 1448 bytes. 03:20:25 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 03:20:25 INFO - Using the following test package requirements: 03:20:25 INFO - {u'common': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 03:20:25 INFO - u'cppunittest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:20:25 INFO - u'firefox-46.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 03:20:25 INFO - u'gtest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:20:25 INFO - u'firefox-46.0a2.en-US.linux-x86_64.gtest.tests.zip'], 03:20:25 INFO - u'jittest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:20:25 INFO - u'jsshell-linux-x86_64.zip'], 03:20:25 INFO - u'mochitest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:20:25 INFO - u'firefox-46.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 03:20:25 INFO - u'mozbase': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 03:20:25 INFO - u'reftest': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:20:25 INFO - u'firefox-46.0a2.en-US.linux-x86_64.reftest.tests.zip'], 03:20:25 INFO - u'talos': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:20:25 INFO - u'firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip'], 03:20:25 INFO - u'web-platform': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:20:25 INFO - u'firefox-46.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 03:20:25 INFO - u'webapprt': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'], 03:20:25 INFO - u'xpcshell': [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip', 03:20:25 INFO - u'firefox-46.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 03:20:25 INFO - Downloading packages: [u'firefox-46.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:20: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')]} 03:20:25 INFO - https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:20:25 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:20:25 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:20:25 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/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 03:20:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/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 03:20:30 INFO - Downloaded 23089507 bytes. 03:20:30 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'] 03:20:30 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 03:20:31 INFO - Return code: 0 03:20:31 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 03:20:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:20:31 INFO - https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:20:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:20:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.common.tests.zip 03:20:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/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 03:20:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/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 03:20:41 INFO - Downloaded 23089507 bytes. 03:20:41 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'] 03:20:41 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 03:20:42 INFO - Return code: 0 03:20:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:20:42 INFO - https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 03:20:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 03:20:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.talos.tests.zip 03:20:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/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 03:20:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/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 03:20:43 INFO - Downloaded 10706649 bytes. 03:20:43 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'] 03:20:43 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 03:20:44 INFO - Return code: 0 03:20:44 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:20:44 INFO - https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 03:20:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 03:20:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 03:20:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/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 03:20:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/ecN41qblTFKJeRO81KL1HQ/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 03:20:45 INFO - Downloaded 59963410 bytes. 03:20:45 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 03:20:45 INFO - mkdir: /builds/slave/test-pgo/properties 03:20:45 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 03:20:45 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 03:20:45 INFO - Contents: 03:20:45 INFO - build_url:https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 03:20:46 INFO - Running post-action listener: _resource_record_post_action 03:20:46 INFO - Running post-action listener: set_extra_try_arguments 03:20:46 INFO - ##### 03:20:46 INFO - ##### Running populate-webroot step. 03:20:46 INFO - ##### 03:20:46 INFO - Running pre-action listener: _resource_record_pre_action 03:20:46 INFO - Running main action method: populate_webroot 03:20:46 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:20:46 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:20:46 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:20:46 INFO - '--tppagecycles', 03:20:46 INFO - '7'], 03:20:46 INFO - 'tests': ['tsvgm']}}, 03:20:46 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 03:20:46 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 03:20:46 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:20:46 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 03:20:46 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 03:20:46 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 03:20:46 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:20:46 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:46 INFO - 'talos_options': ['--e10s'], 03:20:46 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:20:46 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:46 INFO - 'tests': ['damp', 'tps']}, 03:20:46 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:46 INFO - 'talos_options': ['--e10s'], 03:20:46 INFO - 'tests': ['damp', 'tps']}, 03:20:46 INFO - 'g3': {'tests': ['dromaeo_dom']}, 03:20:46 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:20:46 INFO - 'other': {'tests': ['a11yr', 03:20:46 INFO - 'ts_paint', 03:20:46 INFO - 'tpaint', 03:20:46 INFO - 'sessionrestore', 03:20:46 INFO - 'sessionrestore_no_auto_restore']}, 03:20:46 INFO - 'other-e10s': {'talos_options': ['--e10s'], 03:20:46 INFO - 'tests': ['a11yr', 03:20:46 INFO - 'ts_paint', 03:20:46 INFO - 'tpaint', 03:20:46 INFO - 'sessionrestore', 03:20:46 INFO - 'sessionrestore_no_auto_restore']}, 03:20:46 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 03:20:46 INFO - 'tests': ['a11yr', 03:20:46 INFO - 'ts_paint', 03:20:46 INFO - 'tpaint', 03:20:46 INFO - 'sessionrestore', 03:20:46 INFO - 'sessionrestore_no_auto_restore']}, 03:20:46 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 03:20:46 INFO - 'tests': ['a11yr', 03:20:46 INFO - 'ts_paint', 03:20:46 INFO - 'tpaint', 03:20:46 INFO - 'sessionrestore', 03:20:46 INFO - 'sessionrestore_no_auto_restore']}, 03:20:46 INFO - 'other_l64': {'tests': ['a11yr', 03:20:46 INFO - 'ts_paint', 03:20:46 INFO - 'tpaint', 03:20:46 INFO - 'sessionrestore', 03:20:46 INFO - 'sessionrestore_no_auto_restore']}, 03:20:46 INFO - 'other_nol64': {'tests': ['a11yr', 03:20:46 INFO - 'ts_paint', 03:20:46 INFO - 'tpaint', 03:20:46 INFO - 'sessionrestore', 03:20:46 INFO - 'sessionrestore_no_auto_restore']}, 03:20:46 INFO - 'svgr': {'tests': ['tsvgx', 03:20:46 INFO - 'tsvgr_opacity', 03:20:46 INFO - 'tart', 03:20:46 INFO - 'tscrollx', 03:20:46 INFO - 'cart']}, 03:20:46 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 03:20:46 INFO - 'tests': ['tsvgx', 03:20:46 INFO - 'tsvgr_opacity', 03:20:46 INFO - 'tart', 03:20:46 INFO - 'tscrollx', 03:20:46 INFO - 'cart']}, 03:20:46 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:46 INFO - 'tests': ['tp5o']}, 03:20:46 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:46 INFO - 'talos_options': ['--e10s'], 03:20:46 INFO - 'tests': ['tp5o']}, 03:20:46 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:46 INFO - 'talos_options': ['--xperf_path', 03:20:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:20:46 INFO - 'tests': ['tp5n']}, 03:20:46 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:20:46 INFO - 'talos_options': ['--e10s', 03:20:46 INFO - '--xperf_path', 03:20:46 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:20:46 INFO - 'tests': ['tp5n']}}, 03:20:46 INFO - 'talos.zip': {'path': '', 03:20:46 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:20:46 INFO - Running post-action listener: _resource_record_post_action 03:20:46 INFO - ##### 03:20:46 INFO - ##### Running create-virtualenv step. 03:20:46 INFO - ##### 03:20:46 INFO - Running pre-action listener: _resource_record_pre_action 03:20:46 INFO - Running main action method: create_virtualenv 03:20:46 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 03:20:46 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 03:20:46 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 03:20:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:20:46 INFO - Using real prefix '/usr' 03:20:46 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 03:20:46 INFO - Installing distribute.............................................................................................................................................................................................done. 03:20:48 INFO - Installing pip.................done. 03:20:48 INFO - Return code: 0 03:20:48 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 03:20: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')]} 03:20:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:20:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20: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')]} 03:20:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:20:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20:48 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe151bbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c68a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2795230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, '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': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', '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 03:20:48 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test-pgo/build 03:20:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 03:20:48 INFO - Using env: {'DISPLAY': ':0', 03:20:48 INFO - 'HOME': '/home/cltbld', 03:20:48 INFO - 'LANG': 'en_US.UTF-8', 03:20:48 INFO - 'LANGUAGE': 'en_US:en', 03:20:48 INFO - 'LOGNAME': 'cltbld', 03:20:48 INFO - 'MAIL': '/var/mail/cltbld', 03:20:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:20:48 INFO - 'MOZ_NO_REMOTE': '1', 03:20:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:20:48 INFO - 'NO_EM_RESTART': '1', 03:20:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:20:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:20:48 INFO - 'PWD': '/builds/slave/test-pgo', 03:20:48 INFO - 'SHELL': '/bin/bash', 03:20:48 INFO - 'SHLVL': '1', 03:20:48 INFO - 'TERM': 'linux', 03:20:48 INFO - 'TMOUT': '86400', 03:20:48 INFO - 'USER': 'cltbld', 03:20:48 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:20:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:20:48 INFO - '_': '/tools/buildbot/bin/python'} 03:20:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:20:48 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 03:20:48 INFO - Cleaning up... 03:20:48 INFO - Return code: 0 03:20:48 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 03:20: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')]} 03:20:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:20:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20: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')]} 03:20:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:20:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20:48 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fe151bbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c68a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2795230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, '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': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', '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 03:20:48 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test-pgo/build 03:20:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 03:20:48 INFO - Using env: {'DISPLAY': ':0', 03:20:48 INFO - 'HOME': '/home/cltbld', 03:20:48 INFO - 'LANG': 'en_US.UTF-8', 03:20:48 INFO - 'LANGUAGE': 'en_US:en', 03:20:48 INFO - 'LOGNAME': 'cltbld', 03:20:48 INFO - 'MAIL': '/var/mail/cltbld', 03:20:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:20:48 INFO - 'MOZ_NO_REMOTE': '1', 03:20:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:20:48 INFO - 'NO_EM_RESTART': '1', 03:20:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:20:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:20:48 INFO - 'PWD': '/builds/slave/test-pgo', 03:20:48 INFO - 'SHELL': '/bin/bash', 03:20:48 INFO - 'SHLVL': '1', 03:20:48 INFO - 'TERM': 'linux', 03:20:48 INFO - 'TMOUT': '86400', 03:20:48 INFO - 'USER': 'cltbld', 03:20:48 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:20:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:20:48 INFO - '_': '/tools/buildbot/bin/python'} 03:20:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:20:49 INFO - Downloading/unpacking psutil>=0.7.1 03:20:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:20:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:20:49 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:20:49 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:20:49 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:20:49 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:20:50 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 03:20:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:20:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:20:51 INFO - Installing collected packages: psutil 03:20:51 INFO - Running setup.py install for psutil 03:20:51 INFO - building 'psutil._psutil_linux' extension 03:20:51 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 03:20:51 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 03:20:51 INFO - building 'psutil._psutil_posix' extension 03:20:51 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 03:20:51 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 03:20:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:20:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:20:51 INFO - Successfully installed psutil 03:20:51 INFO - Cleaning up... 03:20:51 INFO - Return code: 0 03:20:51 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 03:20:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:20:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:20:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:20:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:20:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20:51 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x7fe151bbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c68a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2795230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, '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': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', '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 03:20:51 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test-pgo/build 03:20:51 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 03:20:51 INFO - Using env: {'DISPLAY': ':0', 03:20:51 INFO - 'HOME': '/home/cltbld', 03:20:51 INFO - 'LANG': 'en_US.UTF-8', 03:20:51 INFO - 'LANGUAGE': 'en_US:en', 03:20:51 INFO - 'LOGNAME': 'cltbld', 03:20:51 INFO - 'MAIL': '/var/mail/cltbld', 03:20:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:20:51 INFO - 'MOZ_NO_REMOTE': '1', 03:20:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:20:51 INFO - 'NO_EM_RESTART': '1', 03:20:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:20:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:20:51 INFO - 'PWD': '/builds/slave/test-pgo', 03:20:51 INFO - 'SHELL': '/bin/bash', 03:20:51 INFO - 'SHLVL': '1', 03:20:51 INFO - 'TERM': 'linux', 03:20:51 INFO - 'TMOUT': '86400', 03:20:51 INFO - 'USER': 'cltbld', 03:20:51 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:20:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:20:51 INFO - '_': '/tools/buildbot/bin/python'} 03:20:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:20:51 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 03:20:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:20:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:20:51 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:20:51 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:20:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:20:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:20:53 INFO - Downloading mozsystemmonitor-0.0.tar.gz 03:20:53 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:20:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 03:20:53 INFO - Installing collected packages: mozsystemmonitor 03:20:53 INFO - Running setup.py install for mozsystemmonitor 03:20:53 INFO - Successfully installed mozsystemmonitor 03:20:53 INFO - Cleaning up... 03:20:53 INFO - Return code: 0 03:20:53 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 03:20: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')]} 03:20:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:20:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20: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')]} 03:20:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:20:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20: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', '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 0x7fe151bbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c68a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2795230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, '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': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', '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 03:20: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', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 03:20: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 blobuploader==1.2.4 03:20:53 INFO - Using env: {'DISPLAY': ':0', 03:20:53 INFO - 'HOME': '/home/cltbld', 03:20:53 INFO - 'LANG': 'en_US.UTF-8', 03:20:53 INFO - 'LANGUAGE': 'en_US:en', 03:20:53 INFO - 'LOGNAME': 'cltbld', 03:20:53 INFO - 'MAIL': '/var/mail/cltbld', 03:20:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:20:53 INFO - 'MOZ_NO_REMOTE': '1', 03:20:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:20:53 INFO - 'NO_EM_RESTART': '1', 03:20:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:20:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:20:53 INFO - 'PWD': '/builds/slave/test-pgo', 03:20:53 INFO - 'SHELL': '/bin/bash', 03:20:53 INFO - 'SHLVL': '1', 03:20:53 INFO - 'TERM': 'linux', 03:20:53 INFO - 'TMOUT': '86400', 03:20:53 INFO - 'USER': 'cltbld', 03:20:53 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:20:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:20:53 INFO - '_': '/tools/buildbot/bin/python'} 03:20:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:20:54 INFO - Downloading/unpacking blobuploader==1.2.4 03:20:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:20:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:20:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:20:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:20:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:20:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:20:55 INFO - Downloading blobuploader-1.2.4.tar.gz 03:20:55 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:20:55 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:20: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 03:20: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 03:20: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 03:20: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 03:20: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 03:20: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 03:20:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 03:20:56 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:20:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:20:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:20:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:20:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:20:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:20:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:20:56 INFO - Downloading docopt-0.6.1.tar.gz 03:20:56 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 03:20:56 INFO - Installing collected packages: blobuploader, requests, docopt 03:20:56 INFO - Running setup.py install for blobuploader 03:20:56 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:20:56 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 03:20:56 INFO - Running setup.py install for requests 03:20:57 INFO - Running setup.py install for docopt 03:20:57 INFO - Successfully installed blobuploader requests docopt 03:20:57 INFO - Cleaning up... 03:20:57 INFO - Return code: 0 03:20:57 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 03:20:57 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')]} 03:20:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:20:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20:57 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')]} 03:20:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:20:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:20:57 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 0x7fe151bbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c68a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2795230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, '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': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', '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 03:20:57 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 03:20:57 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 03:20:57 INFO - Using env: {'DISPLAY': ':0', 03:20:57 INFO - 'HOME': '/home/cltbld', 03:20:57 INFO - 'LANG': 'en_US.UTF-8', 03:20:57 INFO - 'LANGUAGE': 'en_US:en', 03:20:57 INFO - 'LOGNAME': 'cltbld', 03:20:57 INFO - 'MAIL': '/var/mail/cltbld', 03:20:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:20:57 INFO - 'MOZ_NO_REMOTE': '1', 03:20:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:20:57 INFO - 'NO_EM_RESTART': '1', 03:20:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:20:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:20:57 INFO - 'PWD': '/builds/slave/test-pgo', 03:20:57 INFO - 'SHELL': '/bin/bash', 03:20:57 INFO - 'SHLVL': '1', 03:20:57 INFO - 'TERM': 'linux', 03:20:57 INFO - 'TMOUT': '86400', 03:20:57 INFO - 'USER': 'cltbld', 03:20:57 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:20:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:20:57 INFO - '_': '/tools/buildbot/bin/python'} 03:20:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:20:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:20:57 INFO - Running setup.py (path:/tmp/pip-Rr6Gkh-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:20:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:20:57 INFO - Running setup.py (path:/tmp/pip-SmAwwk-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:20:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:20:57 INFO - Running setup.py (path:/tmp/pip-2KBpWd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:20:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:20:57 INFO - Running setup.py (path:/tmp/pip-3ydBWY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:20:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 03:20:57 INFO - Running setup.py (path:/tmp/pip-r8p9Ns-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 03:20:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:20:57 INFO - Running setup.py (path:/tmp/pip-R7plS1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:20:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:20:57 INFO - Running setup.py (path:/tmp/pip-lAcTlb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:20:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:20:57 INFO - Running setup.py (path:/tmp/pip-NteNN6-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:20:57 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 03:20:57 INFO - Running setup.py (path:/tmp/pip-BiJ_sD-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 03:20:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 03:20:58 INFO - Running setup.py (path:/tmp/pip-4zlt7J-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 03:20:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:20:58 INFO - Running setup.py (path:/tmp/pip-SG3dcx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:20:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:20:58 INFO - Running setup.py (path:/tmp/pip-wlNtMo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:20:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:20:58 INFO - Running setup.py (path:/tmp/pip-fVpE0j-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:20:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:20:58 INFO - Running setup.py (path:/tmp/pip-jZdGRZ-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:20:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:20:58 INFO - Running setup.py (path:/tmp/pip-X87QTn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:20:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 03:20:58 INFO - Running setup.py (path:/tmp/pip-pnLCvb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 03:20:58 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 03:20:58 INFO - Running setup.py (path:/tmp/pip-mkiz_O-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 03:20:58 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:20:58 INFO - Running setup.py install for manifestparser 03:20:58 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 03:20:58 INFO - Running setup.py install for mozcrash 03:20:58 INFO - Running setup.py install for mozdebug 03:20:58 INFO - Running setup.py install for mozdevice 03:20:58 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 03:20:58 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Running setup.py install for mozfile 03:20:59 INFO - Running setup.py install for mozhttpd 03:20:59 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Running setup.py install for mozinfo 03:20:59 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Running setup.py install for mozInstall 03:20:59 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Running setup.py install for mozleak 03:20:59 INFO - Running setup.py install for mozlog 03:20:59 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Running setup.py install for moznetwork 03:20:59 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Running setup.py install for mozprocess 03:20:59 INFO - Running setup.py install for mozprofile 03:20:59 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 03:20:59 INFO - Running setup.py install for mozrunner 03:21:00 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 03:21:00 INFO - Running setup.py install for mozscreenshot 03:21:00 INFO - Running setup.py install for moztest 03:21:00 INFO - Running setup.py install for mozversion 03:21:00 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 03:21:00 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:21:00 INFO - Cleaning up... 03:21:00 INFO - Return code: 0 03:21:00 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 03:21:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:00 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 0x7fe151bbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c68a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2795230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, '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': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', '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 03:21:00 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 03:21:00 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 03:21:00 INFO - Using env: {'DISPLAY': ':0', 03:21:00 INFO - 'HOME': '/home/cltbld', 03:21:00 INFO - 'LANG': 'en_US.UTF-8', 03:21:00 INFO - 'LANGUAGE': 'en_US:en', 03:21:00 INFO - 'LOGNAME': 'cltbld', 03:21:00 INFO - 'MAIL': '/var/mail/cltbld', 03:21:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:00 INFO - 'MOZ_NO_REMOTE': '1', 03:21:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:00 INFO - 'NO_EM_RESTART': '1', 03:21:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:21:00 INFO - 'PWD': '/builds/slave/test-pgo', 03:21:00 INFO - 'SHELL': '/bin/bash', 03:21:00 INFO - 'SHLVL': '1', 03:21:00 INFO - 'TERM': 'linux', 03:21:00 INFO - 'TMOUT': '86400', 03:21:00 INFO - 'USER': 'cltbld', 03:21:00 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:21:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:00 INFO - '_': '/tools/buildbot/bin/python'} 03:21:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:21:00 INFO - Running setup.py (path:/tmp/pip-eCeBUy-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 03:21:00 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)) 03:21:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:21:00 INFO - Running setup.py (path:/tmp/pip-oU_o3e-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 03:21:00 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)) 03:21:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:21:00 INFO - Running setup.py (path:/tmp/pip-Clg0d5-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 03:21:00 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)) 03:21:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:21:00 INFO - Running setup.py (path:/tmp/pip-Jp95u0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 03:21:00 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)) 03:21:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 03:21:00 INFO - Running setup.py (path:/tmp/pip-xtY2iI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 03:21:00 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)) 03:21:00 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:21:00 INFO - Running setup.py (path:/tmp/pip-fHOoef-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:21:01 INFO - Running setup.py (path:/tmp/pip-GwJLCx-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:21:01 INFO - Running setup.py (path:/tmp/pip-ZZi7Ze-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 03:21:01 INFO - Running setup.py (path:/tmp/pip-co0Unc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 03:21:01 INFO - Running setup.py (path:/tmp/pip-ykX55y-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:21:01 INFO - Running setup.py (path:/tmp/pip-BKpCUt-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:21:01 INFO - Running setup.py (path:/tmp/pip-WZcfuo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:21:01 INFO - Running setup.py (path:/tmp/pip-UFkhg1-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:21:01 INFO - Running setup.py (path:/tmp/pip-0NGEyn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:21:01 INFO - Running setup.py (path:/tmp/pip-N1pjWb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 03:21:01 INFO - Running setup.py (path:/tmp/pip-2uVcsr-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 03:21:01 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)) 03:21:01 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 03:21:01 INFO - Running setup.py (path:/tmp/pip-_QX2CM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 03:21:01 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)) 03:21:01 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)) 03:21:01 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)) 03:21:01 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)) 03:21:01 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)) 03:21:01 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)) 03:21:01 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 03:21:01 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 03:21:01 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 03:21:01 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 03:21:01 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 03:21:01 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 03:21:01 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 03:21:03 INFO - Downloading blessings-1.6.tar.gz 03:21:03 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 03:21:03 INFO - Installing collected packages: blessings 03:21:03 INFO - Running setup.py install for blessings 03:21:03 INFO - Successfully installed blessings 03:21:03 INFO - Cleaning up... 03:21:03 INFO - Return code: 0 03:21:03 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 03:21:03 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 03:21:03 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 03:21:04 INFO - Reading from file tmpfile_stdout 03:21:04 INFO - Current package versions: 03:21:04 INFO - argparse == 1.2.1 03:21:04 INFO - blessings == 1.6 03:21:04 INFO - blobuploader == 1.2.4 03:21:04 INFO - docopt == 0.6.1 03:21:04 INFO - manifestparser == 1.1 03:21:04 INFO - mozInstall == 1.12 03:21:04 INFO - mozcrash == 0.16 03:21:04 INFO - mozdebug == 0.1 03:21:04 INFO - mozdevice == 0.48 03:21:04 INFO - mozfile == 1.2 03:21:04 INFO - mozhttpd == 0.7 03:21:04 INFO - mozinfo == 0.9 03:21:04 INFO - mozleak == 0.1 03:21:04 INFO - mozlog == 3.1 03:21:04 INFO - moznetwork == 0.27 03:21:04 INFO - mozprocess == 0.22 03:21:04 INFO - mozprofile == 0.28 03:21:04 INFO - mozrunner == 6.11 03:21:04 INFO - mozscreenshot == 0.1 03:21:04 INFO - mozsystemmonitor == 0.0 03:21:04 INFO - moztest == 0.7 03:21:04 INFO - mozversion == 1.4 03:21:04 INFO - psutil == 3.1.1 03:21:04 INFO - requests == 1.2.3 03:21:04 INFO - wsgiref == 0.1.2 03:21:04 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 03:21:04 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')]} 03:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:04 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')]} 03:21:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:04 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 0x7fe151bbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c68a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2795230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, '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': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', '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 03:21:04 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 03:21:04 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 03:21:04 INFO - Using env: {'DISPLAY': ':0', 03:21:04 INFO - 'HOME': '/home/cltbld', 03:21:04 INFO - 'LANG': 'en_US.UTF-8', 03:21:04 INFO - 'LANGUAGE': 'en_US:en', 03:21:04 INFO - 'LOGNAME': 'cltbld', 03:21:04 INFO - 'MAIL': '/var/mail/cltbld', 03:21:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:04 INFO - 'MOZ_NO_REMOTE': '1', 03:21:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:04 INFO - 'NO_EM_RESTART': '1', 03:21:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:21:04 INFO - 'PWD': '/builds/slave/test-pgo', 03:21:04 INFO - 'SHELL': '/bin/bash', 03:21:04 INFO - 'SHLVL': '1', 03:21:04 INFO - 'TERM': 'linux', 03:21:04 INFO - 'TMOUT': '86400', 03:21:04 INFO - 'USER': 'cltbld', 03:21:04 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:21:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:04 INFO - '_': '/tools/buildbot/bin/python'} 03:21:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:04 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)) 03:21:04 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)) 03:21:04 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)) 03:21:04 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)) 03:21:04 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)) 03:21:04 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)) 03:21:04 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)) 03:21:04 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)) 03:21:04 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)) 03:21:04 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)) 03:21:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test-pgo/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test-pgo/build/tests/talos/requirements.txt (line 4)) 03:21:04 INFO - Cleaning up... 03:21:04 INFO - Return code: 0 03:21:04 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 03:21:04 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')]} 03:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:04 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')]} 03:21:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:04 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 0x7fe151bbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c68a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2795230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, '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': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', '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 03:21:04 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 03:21:04 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 03:21:04 INFO - Using env: {'DISPLAY': ':0', 03:21:04 INFO - 'HOME': '/home/cltbld', 03:21:04 INFO - 'LANG': 'en_US.UTF-8', 03:21:04 INFO - 'LANGUAGE': 'en_US:en', 03:21:04 INFO - 'LOGNAME': 'cltbld', 03:21:04 INFO - 'MAIL': '/var/mail/cltbld', 03:21:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:04 INFO - 'MOZ_NO_REMOTE': '1', 03:21:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:04 INFO - 'NO_EM_RESTART': '1', 03:21:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:21:04 INFO - 'PWD': '/builds/slave/test-pgo', 03:21:04 INFO - 'SHELL': '/bin/bash', 03:21:04 INFO - 'SHLVL': '1', 03:21:04 INFO - 'TERM': 'linux', 03:21:04 INFO - 'TMOUT': '86400', 03:21:04 INFO - 'USER': 'cltbld', 03:21:04 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:21:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:04 INFO - '_': '/tools/buildbot/bin/python'} 03:21:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:04 INFO - Downloading/unpacking jsonschema 03:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:06 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:21:06 INFO - Downloading/unpacking functools32 (from jsonschema) 03:21:06 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 03:21:06 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 03:21:06 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 03:21:06 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 03:21:06 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 03:21:06 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 03:21:06 INFO - Downloading functools32-3.2.3-2.tar.gz 03:21:06 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 03:21:06 INFO - warning: no files found matching '*.txt' 03:21:06 INFO - no previously-included directories found matching 'build' 03:21:06 INFO - no previously-included directories found matching 'dist' 03:21:06 INFO - no previously-included directories found matching '.git*' 03:21:06 INFO - Installing collected packages: jsonschema, functools32 03:21:06 INFO - Running setup.py install for functools32 03:21:06 INFO - warning: no files found matching '*.txt' 03:21:06 INFO - no previously-included directories found matching 'build' 03:21:06 INFO - no previously-included directories found matching 'dist' 03:21:06 INFO - no previously-included directories found matching '.git*' 03:21:06 INFO - Successfully installed jsonschema functools32 03:21:06 INFO - Cleaning up... 03:21:06 INFO - Return code: 0 03:21:06 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 03:21:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:21:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:21:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:21:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:21:06 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fe151bbdf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x26c68a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2795230>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, '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': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', '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 03:21:06 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test-pgo/build 03:21:06 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 03:21:06 INFO - Using env: {'DISPLAY': ':0', 03:21:06 INFO - 'HOME': '/home/cltbld', 03:21:06 INFO - 'LANG': 'en_US.UTF-8', 03:21:06 INFO - 'LANGUAGE': 'en_US:en', 03:21:06 INFO - 'LOGNAME': 'cltbld', 03:21:06 INFO - 'MAIL': '/var/mail/cltbld', 03:21:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:06 INFO - 'MOZ_NO_REMOTE': '1', 03:21:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:06 INFO - 'NO_EM_RESTART': '1', 03:21:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:21:06 INFO - 'PWD': '/builds/slave/test-pgo', 03:21:06 INFO - 'SHELL': '/bin/bash', 03:21:06 INFO - 'SHLVL': '1', 03:21:06 INFO - 'TERM': 'linux', 03:21:06 INFO - 'TMOUT': '86400', 03:21:06 INFO - 'USER': 'cltbld', 03:21:06 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:21:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:06 INFO - '_': '/tools/buildbot/bin/python'} 03:21:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:21:07 INFO - Downloading/unpacking flake8 03:21:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:08 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 03:21:08 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 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 03:21:08 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 03:21:09 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 03:21:09 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 03:21:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:09 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 03:21:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:21:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:21:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:21:09 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 03:21:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:21:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:21:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:21:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:21:09 INFO - no previously-included directories found matching 'docs/_build' 03:21:09 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 03:21:09 INFO - Running setup.py install for pep8 03:21:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 03:21:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 03:21:09 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 03:21:09 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 03:21:09 INFO - no previously-included directories found matching 'docs/_build' 03:21:09 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 03:21:09 INFO - Successfully installed flake8 mccabe pyflakes pep8 03:21:09 INFO - Cleaning up... 03:21:09 INFO - Return code: 0 03:21:09 INFO - Running post-action listener: _resource_record_post_action 03:21:09 INFO - Running post-action listener: _start_resource_monitoring 03:21:09 INFO - Starting resource monitoring. 03:21:09 INFO - ##### 03:21:09 INFO - ##### Running install step. 03:21:09 INFO - ##### 03:21:09 INFO - Running pre-action listener: _resource_record_pre_action 03:21:09 INFO - Running main action method: install 03:21:09 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 03:21:09 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 03:21:10 INFO - Reading from file tmpfile_stdout 03:21:10 INFO - Detecting whether we're running mozinstall >=1.0... 03:21:10 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 03:21:10 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 03:21:10 INFO - Reading from file tmpfile_stdout 03:21:10 INFO - Output received: 03:21:10 INFO - Usage: mozinstall [options] installer 03:21:10 INFO - Options: 03:21:10 INFO - -h, --help show this help message and exit 03:21:10 INFO - -d DEST, --destination=DEST 03:21:10 INFO - Directory to install application into. [default: 03:21:10 INFO - "/builds/slave/test-pgo"] 03:21:10 INFO - --app=APP Application being installed. [default: firefox] 03:21:10 INFO - mkdir: /builds/slave/test-pgo/build/application 03:21:10 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'] 03:21:10 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 03:21:25 INFO - Reading from file tmpfile_stdout 03:21:25 INFO - Output received: 03:21:25 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 03:21:25 INFO - Running post-action listener: _resource_record_post_action 03:21:25 INFO - ##### 03:21:25 INFO - ##### Running run-tests step. 03:21:25 INFO - ##### 03:21:25 INFO - Running pre-action listener: _resource_record_pre_action 03:21:25 INFO - Running main action method: run_tests 03:21:25 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 03:21:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 03:21:25 INFO - Python 2.7.3 03:21:25 INFO - Return code: 0 03:21:25 INFO - grabbing minidump binary from tooltool 03:21: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')]} 03:21:25 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 0x28277f0>, '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 0x27932d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2793760>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 03:21:25 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 03:21:25 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 03:21:25 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:21:25 INFO - Return code: 0 03:21:25 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 03:21:25 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 03:21:25 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 03:21:25 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 03:21:25 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 03:21:25 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 03:21:25 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 03:21:26 INFO - Return code: 0 03:21:26 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/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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 03:21:26 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/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-002 --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 03:21:26 INFO - Using env: {'DISPLAY': ':0', 03:21:26 INFO - 'HOME': '/home/cltbld', 03:21:26 INFO - 'LANG': 'en_US.UTF-8', 03:21:26 INFO - 'LANGUAGE': 'en_US:en', 03:21:26 INFO - 'LOGNAME': 'cltbld', 03:21:26 INFO - 'MAIL': '/var/mail/cltbld', 03:21:26 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 03:21:26 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 03:21:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:21:26 INFO - 'MOZ_NO_REMOTE': '1', 03:21:26 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 03:21:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:21:26 INFO - 'NO_EM_RESTART': '1', 03:21:26 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:21:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 03:21:26 INFO - 'PWD': '/builds/slave/test-pgo', 03:21:26 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 03:21:26 INFO - 'SHELL': '/bin/bash', 03:21:26 INFO - 'SHLVL': '1', 03:21:26 INFO - 'TERM': 'linux', 03:21:26 INFO - 'TMOUT': '86400', 03:21:26 INFO - 'USER': 'cltbld', 03:21:26 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386', 03:21:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:21:26 INFO - '_': '/tools/buildbot/bin/python'} 03:21:26 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/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--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 03:21:26 INFO - mozversion application_buildid: 20160302004006 03:21:26 INFO - mozversion application_changeset: d755e1b8c8f062020a85166235fe05dd88bb6feb 03:21:26 INFO - mozversion application_display_name: FirefoxDeveloperEdition 03:21:26 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:21:26 INFO - mozversion application_name: Firefox 03:21:26 INFO - mozversion application_remotingname: firefox-dev 03:21:26 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:21:26 INFO - mozversion application_vendor: Mozilla 03:21:26 INFO - mozversion application_version: 46.0a2 03:21:26 INFO - mozversion platform_buildid: 20160302004006 03:21:26 INFO - mozversion platform_changeset: d755e1b8c8f062020a85166235fe05dd88bb6feb 03:21:26 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 03:21:26 INFO - mozversion platform_version: 46.0a2 03:21:26 INFO - using testdate: 1456917686 03:21:26 INFO - actual date: 1456917686 03:21:26 INFO - starting webserver on 'localhost:60915' 03:21:26 INFO - SUITE-START | Running 3 tests 03:21:26 INFO - TEST-START | dromaeo_css 03:21:26 INFO - operating with platform_type : linux_ 03:21:26 INFO - Initialising browser for dromaeo_css test... 03:21:26 INFO - TEST-INFO | started process 29268 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpKwMRua/profile http://localhost:60915/getInfo.html) 03:21:30 INFO - PROCESS | 29268 | 03:21:30 INFO - PROCESS | 29268 | (process:29347): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:21:31 INFO - PROCESS | 29268 | __metrics Screen width/height:1600/1200 03:21:31 INFO - PROCESS | 29268 | colorDepth:24 03:21:31 INFO - PROCESS | 29268 | Browser inner width/height: 1024/697 03:21:31 INFO - PROCESS | 29268 | __metrics 03:21:32 INFO - TEST-INFO | 29268: exit 0 03:21:32 INFO - Browser initialized. 03:21:32 INFO - Running cycle 1/1 for dromaeo_css test... 03:21:32 INFO - TEST-INFO | started process 29396 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpKwMRua/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:21:33 INFO - PROCESS | 29396 | 03:21:33 INFO - PROCESS | 29396 | (process:29459): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:21:43 INFO - PROCESS | 29396 | RSS: Main: 141426688 03:21:43 INFO - PROCESS | 29396 | 03:22:33 INFO - PROCESS | 29396 | 1456917753526 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] 03:24:41 INFO - PROCESS | 29396 | Cycle 1(1): loaded http://localhost:60915/tests/dromaeo/cssquery-dojo.html (next: http://localhost:60915/tests/dromaeo/cssquery-ext.html) 03:24:42 INFO - PROCESS | 29396 | RSS: Main: 146210816 03:24:42 INFO - PROCESS | 29396 | 03:27:44 INFO - PROCESS | 29396 | Cycle 1(1): loaded http://localhost:60915/tests/dromaeo/cssquery-ext.html (next: http://localhost:60915/tests/dromaeo/cssquery-jquery.html) 03:27:44 INFO - PROCESS | 29396 | RSS: Main: 144474112 03:27:44 INFO - PROCESS | 29396 | 03:30:46 INFO - PROCESS | 29396 | Cycle 1(1): loaded http://localhost:60915/tests/dromaeo/cssquery-jquery.html (next: http://localhost:60915/tests/dromaeo/cssquery-mootools.html) 03:30:47 INFO - PROCESS | 29396 | RSS: Main: 143265792 03:30:47 INFO - PROCESS | 29396 | 03:33:48 INFO - PROCESS | 29396 | Cycle 1(1): loaded http://localhost:60915/tests/dromaeo/cssquery-mootools.html (next: http://localhost:60915/tests/dromaeo/cssquery-prototype.html) 03:33:49 INFO - PROCESS | 29396 | RSS: Main: 144605184 03:33:49 INFO - PROCESS | 29396 | 03:36:51 INFO - PROCESS | 29396 | Cycle 1(1): loaded http://localhost:60915/tests/dromaeo/cssquery-prototype.html (next: http://localhost:60915/tests/dromaeo/cssquery-yui.html) 03:36:52 INFO - PROCESS | 29396 | RSS: Main: 143306752 03:36:52 INFO - PROCESS | 29396 | 03:39:54 INFO - PROCESS | 29396 | Cycle 1(1): loaded http://localhost:60915/tests/dromaeo/cssquery-yui.html (next: http://localhost:60915/tests/dromaeo/cssquery-dojo.html) 03:39:54 INFO - PROCESS | 29396 | RSS: Main: 146718720 03:39:54 INFO - PROCESS | 29396 | 03:39:54 INFO - PROCESS | 29396 | __start_tp_report 03:39:54 INFO - PROCESS | 29396 | _x_x_mozilla_page_load 03:39:54 INFO - PROCESS | 29396 | _x_x_mozilla_page_load_details 03:39:54 INFO - PROCESS | 29396 | |i|pagename|runs| 03:39:54 INFO - PROCESS | 29396 | |0;dojo.html;3338.8163650999186;3343.247769251918;3352.245744707441;3357.630660627332;3388.7797293175936;5369.650972686777;5370.973145134279;5395.676259424437;5423.376311724148;5427.348718153822;5417.431169727181;5469.589780766439;5470.589705772063;5473.890522189564;5483.287172667548;4950.653454258212;5006.54941055305;5053.166227572465;5074.594032477393;5138.5889128869785;4935.950640493603;4994.850154495371;5077.441481437039;5080.84757457275;5086.21163719624;5060.671056381342;5095.286659867622;5135.743212839362;5137.460566640505;5142.408623008346;5071.518205770446;5090.109230884599;5118.488151184889;5132.204508301219;5140.948590514103;4855.708657480563;4875.098106850244;4936.037472692827;5031;5045.848624541233;5202.869928251824;5257.395399529065;5284.735763211824;5284.762185701653;5335.919961200585;5900.262467191601;5915.674637894914;5928.7924922627935;5940.762369505214;5946.524278057788;5770.7691692332255;5843.9707801461145;5934.258217722785;5979.850503737398;5991.310999235056;5602.803901863415;5616.045272303718;5617;5631.211630371751;5648.661080335193;6121.143039974407;6131.540134489931;6131.6321020738005;6156.815295541141;6165.32181460039;5694.60137790359;5728.226689396962;5863.67749773758;5873.911891321633;5957.880842383128;5910.497607703393;5910.822675319747;5913.408659134138;5920.2303700519515;5946.316173640087;5852.975729247365;5891.322497912709;5894.351621321651;5899.410058994066;5905.43898329658;5840.240768700127;5849.532037436995;5915.905557471881;5925.200097986803;5953.583249172603;4511.1654343946475;4535.047639995571;4536.750478723702;4544.522825103382;4565.885852853705;4040.616141466556;4083.183363327287;4093.038136038029;4098.692598055098;4122.42286079949;5557.638753481011;5621.269234999424;5623.437656234344;5702.7718891243885;5730.77076916927;6003.459688628044;6003.6397816131175;6013.609115407485;6025.578209525379;6034.607750496204;5463.48096930791;5621.578381621313;5702.258706368146;5714.0571805652435;5715.799947001835;5109.591232701375;5112.079825631422;5131.589472842164;5132.230165475134;5134.024535338349;6066.726997285133;6075.939240607626;6077.878442431127;6105.358937311607;6127.571070025145;5873;5886.911696324644;5948.762049517971;5954;5974.074018527135;6144.003198960267;6163.753449861955;6175.938240617536;6180.6909654517995;6186.072089186658;5912.142739302863;5913.674747888907;5919.112133180058;5945.197398351167;5954.7320370582565;5898.203742494708;5899.970500147472;5961.672108034099;5967.1944287522365;6012.3085845126625;5737.540996720169;5741.081426971665;5760.395158508464;5762.740676669644;5774.624649397776;5717.399673034438;5731.111677689964;5770.769169233352;5773.04744717117;5786.5081468074;5650.491455769001;5666.291713535808;5741.712914354182;5765.971170144123;5768.567357448124;5827;5831.067029275296;5838.912416313674;5858.2677165354335;5879.059350503899;5660;5668.03643380618;5693.231413759255;5699.743511542073;5709.571782116441 03:39:54 INFO - PROCESS | 29396 | |1;ext.html;548.7851760725819;556.2074044486606;581.8254523642906;584.7777844419121;622.7415622516655;39560.604393956055;39640.60359396405;39725.20549589006;39959.200815983735;40221.19557608846;43381.7830910845;43896.3415548767;43998.340024899655;44104.558954410524;44118.33822492657;8655.740327790161;8956.776080597972;8987;8987.325950553703;8989.595468203946;8799.076097009818;8898.644054237822;8903.465792052497;8907.198352148305;8928.955355223216;9091.681791137311;9184.494852783095;9194.678186263482;9203.401778884385;9214.308926830481;9014.774630634254;9106.544672766368;9107.408018478778;9128.315376346767;9155.13026262504;8828.867566986437;8931.50876701781;8948.686795962176;8972.41679290844;8973.41672791273;43077;43275.56724432778;43305.13389732187;43309.78345108254;43369;3470.7396945229207;3717.275131349388;3882.456456096149;4128.2156390285745;4233.216854881826;32863.835680821685;32935.34129317424;33133.6686633133;33769.83115084434;34753.65246347555;4006.6193711597352;4015.1166743316426;4068.9186216275507;4095.201435720036;4160.750354978711;285833;286510;287047;287101;287384;45204.321935171;45337.77331113389;45591.77204113958;45804.08391832211;64366.35633643697;44174.33738493925;44265.557344426146;44331.33502997458;44337;44406.11187776226;15643.843561564467;15664.843351566566;15790.289436975363;15791.131487768283;15860;12577.182483138567;12656.493740250287;12753.744925101446;12775.105742597929;12862.67843303925;15416.768748468781;15572.909896307376;15574.221288935509;15588.376464941275;15605.3757849687;6007.639541627516;6079.331273559905;6107.816765497042;6201.503879689614;6228.906566401508;1037.2998226197287;1052.7947050325267;1117.8770335263114;1141.57191053355;1183.3964678014274;33483.83258083694;35770.46344304838;36608.81695591558;36835.26329473449;36904.44643330352;1084.4469320646526;1133.9489722962487;1166.1312322319925;1178.092868491257;1240.2000709542474;16499.752503712454;16499.752503712454;16556.586085347964;16580.502584922473;16670.749938750927;440758;548341;548535;550646;550792;55093.173602396;55964.16053759197;56419;56799.71600141973;56920.146197807066;1445.161806152429;1448.2107251547932;1456.4611093895326;1456.766917293228;1458.1251249250365;30675.2331191722;33075.50386744153;33156;33335.49996750099;33409.33181336311;50962;51273.743631281606;51397.48602513927;51526.48473515367;51702.741486292325;270640;270924;270973;271006;271405;34670.47994280138;35044.64955350516;35401.46897796483;35459.11352216215;35715.82142089377;46182.53817461917;47031.52968470271;47345.28982065341;47681.28478072762;47914.281285781435;39359.40960885532;39640;39918;40557.797211014935;40753;41773.37339939964;41836;43381.78309108561;43877;47832.76083619699;41625.37561936513;43446.565534345515;43691;44227.557724422346;44760.552394475635;33510.832445837616;35935.46096808602;36434.453483198304;37602.24795504129;38764.61235387723;27655.30861728473;28400.715992839807;28458.43083138367;28727.856360718062;31127 03:39:54 INFO - PROCESS | 29396 | |2;jquery.html;391.50865663592197;391.55362886309604;397.58055251709436;399.9940000899987;400.31745873286053;15268.84731152688;15655.843441565581;17143.314267429305;17745.911270443645;17770.555736106602;12044.57843975461;12305.384730763448;16029.278682459288;17868.64262714745;17877.374291899785;5165.560927321173;5722.484976352128;5762.97118514409;5769.480746732793;5783.5951483396175;5318.6011049171275;5513.889722205554;5515.834524964237;5518.806841760539;5615.129654903476;5484.424135465779;5505.201745746865;6784.559003664771;7009.82475438113;7037.7536786212495;6434.453071488929;6653.035309880089;6991.930080699179;7033.577985320871;7050;6317.925952588071;6346.11154438379;6410.775622853178;6448.54860159789;6454.93545064548;21503.2473863414;21838.454038649;21975.780242197532;24222.152224672052;24535.63196552053;2569.601711734684;2577.355661084729;2608.2175347395705;2608.699999500063;2871.3826527296733;14186.71626567463;14727.484538041224;14746.557603271918;14972.326245318878;15328.540143795704;2052.8973551322374;2079.4177630263553;2169.197396963118;2196.9890150549304;2224.043661225672;67167.32832671709;68870;70800.6459967702;71064.28935710629;71979.2802071983;16203.756943645854;16213.35146594123;16344.75482867758;16364.672706545802;16526.42157524505;25477.10830120937;25539.61690574643;25593.360165995626;26066.087686930867;26088.217353479045;7832.647530861125;7866.685332586632;8118.512889226666;8231.382646301552;8258.958705206556;7703.845923081507;7889.408294377829;7992.920070799334;7999.0801057877925;8018.959905200437;4651.837185698484;4714.693544919569;4804.567588916944;4851.320815085891;4866.4403593586485;1948.4933917181352;1965.2924947019062;1970.103602860695;1981.6333978214077;1987.125664707524;1004.0963133180196;1004.6232662751469;1062.1821197677746;1073.7959787640323;1091.946271847671;17141.657166856592;17182.31270749156;17316.220770065378;17594.38419655306;18312.54218644518;1010.3584224017654;1028.861103750999;1041;1061.2200032975757;1074.1943542343242;9703.320767546204;10173.745656358651;10245.334053286513;10310.587576497006;10369.844452333222;683261;689413;693902;699765;700762;69648.95526567106;76225;79240.20759792444;79437.60281198558;82104;1206.5776978057786;1242.8322176506238;1245.0475386329283;1250.724840535099;1251.7308778612642;16140;16243.59391015234;16249.837501624832;16496.917515412348;16535.338586456408;33171.50242746409;33177;33937.32125357429;34091.82954085214;34900.47649285314;43159.568404315556;43588.78205608952;45300.32049519326;45605.31592026056;45776.397826075925;7677.731279405194;7875.803104922423;7985.441019128605;7988.760337189894;8014.278714915686;8514.957425212835;10844;10860.837087443853;11481;11668.70828229301;9523.904760952579;9971.252156088178;10007.446755696827;10677.359358438518;10810.729731756768;7286.271372862671;8244.175582441709;9996.20030397581;10330.380177189392;10558;7866.9213307866185;8090.555019473985;8191.79520511992;8230.670773169006;8301.626426810688;10210.438425886647;10273.332233404804;10298.124659403735;10308.278420510493;10359.430231337348;10975.725606859893;10994.560217591206;11060.557577696802;11199.552017919192;11275.887241127484 03:39:54 INFO - PROCESS | 29396 | |3;mootools.html;1537.085434166671;1550.062212361521;1796.2814874050378;1883.1714045819847;1929.479040659022;8209.302209312209;8245.587720613976;8440.873386899202;8469.280111190548;8478.406511544194;8164.306033987104;8185.631646575904;8250.669973201066;8256.215659512336;8273.255407013368;2465.4452748131707;2484.8757562121823;2494.837835540684;2496.7253602103756;2497.4505608766044;2499.525090232859;2512.1207577347873;2516.119358224616;2520.584103622909;2523.5836087045614;2392.4258178037235;2439.207257641274;2443.108265483095;2458.9877050614723;2482.094035676974;2472.27068014936;2473.332200305916;2494.663220465232;2498.4503409249937;2523.911663091783;2447;2474.183519438599;2490.663760392342;2498.6376975338476;2508.648789169518;8194.590270486451;8288.751337459886;8303.792405189919;8339.708110216174;8343.666253349858;5028.572571331441;5172.818951336685;5192.766325515361;5201.271821944931;5208.8437346879655;3214.067920303109;3235.854386552611;3253.219227385434;3260.10347154532;3271.6401195868434;1069.9437211589554;1118.3513562133942;1140.840282360462;1146.9770604587861;1147.0651419093413;11924.284542927453;11935.045196384268;11954.521819127225;11989.340586267752;12045;4466.531014243523;4510.323451482304;4558.293464513005;4567.2920697291975;4584.404027476407;9659.517024148765;9679.66121185755;9693.030696930251;9698.36960597573;9702;5124.718140502234;5154.329937108152;5159.045576568347;5173.379194496684;5208.765605547759;4754.7147171169845;4772.403449568804;4773.37946067009;4780.426348838162;4792.544708252711;3727.142757165867;3850.9037274068373;3865.362215234511;3883.5339759229073;3891.571927088018;1081.167501024207;1152.5793085523724;1176.4000359816555;1182.6924999500193;1189.5776999165346;1128.3850301585492;1141.1384404774342;1166.4809159923752;1172.3083380805365;1186.833843261944;7603.543787372775;7654.8086297843;7688.923110768821;7712.7300544481795;7761.72833950809;1194.832723418722;1195.5994741761433;1199.5501686867424;1203.8314635950974;1213.538855235005;6028.909566356509;6086.695665216722;6108.877822443526;6131.754729810847;6151.907721384183;9711.951440242754;9896.851547226797;9901.455419951828;9910.55402506889;10063.396196228103;9610.327277090677;9769.804603908024;9795.118439340351;9840.015998400102;9856.359336643096;7715.961420192863;7793.142754297023;7850.411219158586;7865.7246996356;7967.362610991223;7729.768106956801;7830.256125668053;7852.528848269122;7944.960275198587;8150.307223886036;9111.498867562348;9151.725448236564;9172.12864777845;9259.120383563552;9281.860772088288;9270.397424167677;9390.154886060287;9424.104710052534;9431.386959847589;9450.196733277473;7574.053243344582;7700.614969251627;7709.4603377763015;7727.459077864495;7728.92271077282;7992;8035.276825085536;8126.471779334324;8129.105798362057;8152.714654987047;7660.923390766021;7844.529328240324;7873.606319684108;7884.369250459835;7892.210778922062;7351.705931762884;7450.031495905714;7454.515456495311;7485.5508669480005;7498.925010749823;7403.185649578434;7435.330820226206;7469.626518674153;7491.812704682427;7493.325600695964;6960.443164546926;6962.930370696228;7011.193712722898;7016.5790052597;7021.754238601625;6994.9300506996315;7061.046758687511;7067.187273463617;7081.256468070985;7164.355208031302 03:39:54 INFO - PROCESS | 29396 | |4;prototype.html;353.63928792631515;360.3010160289039;362.41470025908166;364.84858783604807;368.01922875536695;6259.843503912404;6268.592541484801;6281.685915704219;6285.120083188357;6371.649559274249;6178.13506109144;6334.619922804635;6339.492840572755;6358.9364106359035;6363.681815909197;4906.337644418011;4943.629227807911;4945.332380128691;4948.084604348189;4954.083494553519;4927.778249978742;4930.506949305077;4933.80264789408;4938.160512712848;4956.7769450374635;4652.837150699726;4832.323474713543;4834.283829240604;4849.806007759703;4862.878428039309;4807.254875494304;4823.0353929214125;4824.083424149418;4834.250691142861;4844.079624871263;4207.137536804948;4216.3464662977285;4222.746635201897;4230.238557059728;4233.068724880522;5937.67342796146;6024.608400453956;6026.758929642809;6031.884101441247;6051.2133422655215;5643.887122257532;5644.8306550803545;5650.180723795068;5654.830355089354;5656.575756818255;6704.128463299789;6737.056812046318;6743.561668491532;6745.561538499982;6754.763583274611;4621.953780462186;4632.050429661911;4647.907041859177;4659.627229821606;4670.883227919295;6869.141357330333;6951.826204344881;6966.965165174192;6982.476314276399;7056.54132481387;4815.807367705253;4835.0571638530855;4837.7097374157665;4837.830675926326;4842.055799119138;4875.756682046126;4877.878053048631;4883.194272944925;4892.119418504703;4895.583875370562;5538.335399751975;5648.5481161507805;5665.178549110356;5665.490105890407;5667.8866422672145;6774.085498457744;6787.728490860409;6803.625800580917;6822.454203663695;6830.112085428962;1675.346614820221;1715.4167583021833;1715.8541523970353;1720.984619074752;1722.2852516205635;1132.360216477704;1148.26511032939;1153.5904753812445;1165.516310731037;1168.8772678868766;6403.807885763435;6407;6412.583182093243;6426.935730642727;6433.613983161025;6871.518993670495;6878.621675807779;6896.27589103147;6909.930900691029;6935.653217339213;6384.904226436607;6409.9679501602195;6421.775237866652;6436.292007879129;6457.838554036187;3784.1863999240295;3809;3809.257194846978;3812.390017597171;3815.942760858534;7306.452016098814;7311.817204569822;7319.963400183072;7346.853062938711;7359.153697324876;7145.821354466076;7299.70801167958;7305.634718264066;7310.597917114504;7320.194778574352;7264.346208841124;7298.56208627484;7299.489035767445;7311.3785328247695;7314.561126332331;7059.752908648378;7063.223045464892;7091.468139889425;7092.219855815959;7110.0401445804155;6744.494162937701;6921.48088893325;6923.169219693669;6974.511784175059;6986.54587451814;7235.421166306577;7276;7316.158641756053;7324.08448943882;7345.375643070399;4840.491748366511;4844.563989240985;4844.806207751792;4857.757112144308;4864.92702609454;6832.111825462658;6896.551724137915;7064.788056358318;7068.787936361918;7105.467089968376;6835.316468353125;6855.07456493367;6895.793126206222;6921.134858142732;6934.445244380337;6845.281245469154;6876.621785801829;6883.105196324445;6888.276730943379;6892.138482689664;6598.769043083469;6758.256591774999;6766.661666916733;6767.917133258655;6808.114945057309;6906.896396554156;6924.549904256207;6926.168859736864;6929.826754331182;6931.098957135742;6626.966865165643;6626.966865165643;6634.635095069624;6641.203055633355;6697.966510167613 03:39:54 INFO - PROCESS | 29396 | |5;yui.html;804.1958041958042;875.7941883657339;882.4881568690156;883.6067949762358;900.6307413960276;14416.279186040696;16159.757603635955;16201.108939008365;16374.263158157897;16379.181040947935;14172.787408188886;14174.787378189336;14188.787168192459;14207.71584568308;14229.217393043378;901.6753968571309;904.3127223310265;926.9988412514502;928.1461055828654;929.7536152919482;916.9724908252763;918.8851393575803;919.4207649181006;919.6781126605702;920.8342498350328;953.5280036382001;954.7851733359973;955.72284037629;958.2382006305004;958.4536814016013;938.9577568898517;942.8727121838533;943.5989704375613;947.6541062512202;948.0756262643902;701.5334802356427;702.0907924238073;706.0397858911875;707.7664370757637;708.019393140499;14933.850661493463;15052.096874187475;15077.698446031127;15107.4712385066;15158.696826063417;13419.396127174301;13422.261775602436;13497.730045399136;13568.796468052988;13660.385282662304;10914.563417463292;10978.231523793338;11012.779744405147;11088.667339979733;11145.1641126915;3754.286685529768;3776.2825063237897;3788.3749181385037;3789.280036793028;3811.5045044144085;52814.47185528172;53199.73400132974;53232;53280.20079698808;53485.465145348826;10738;10765.83851242232;10896;10956.178286628376;11024.50389732464;19581.706274405897;19584.510387240432;19652;19656;19662.70505942412;7951.562664053533;8020.639071241808;8058.758237252775;8129.674813007414;8282.8343433131;4527.977360113178;4574.45106587205;4627.120847039052;4656.3946686930485;4709.62323014158;3035.575019497272;3077.1845460952864;3081.3221091359865;3089.5365695145906;3093.273080826004;568.8720037991419;575.4878158438993;580.1442871764199;581.2647001543052;591.0336599659588;547.1764993684479;548.6187099965565;613.2793967088653;621.2824188062795;663.1577896071962;8930.955345223363;9023.097690230925;9076.364654474124;9114.635414583476;9332.626694932262;621.4096608222206;651.3942033908415;653.3531803514486;710.2719712294939;720.0135813934838;4150.833966641361;4161;4230.513490948519;4230.725002874803;4326.610605045561;55617;56076;56103;60864.39135608676;61299.38700612937;51238.23142652863;51836.74081629568;52209.73895130576;52293.47706522962;55262;48257.75871120622;48719.51280487292;49224.26163607549;49452.258216126786;50017.74991125021;9044.592993315186;9297.209737172416;9332.30007749435;9341.11259430353;9516.157205240175;35918.461223082195;35989.46015809713;36027.27945441129;36442.63557364392;36886.89339319825;44200.55799441964;48032.27951580799;48232.758836206995;48249.75875120602;48509;10970.835437468604;11182.32906025641;11724.062075034148;11853.466594003117;12247.08146888969;11985.700357490783;13017.739645206853;13234.272115033766;13323.733525329633;13754.65613359674;12840.61478155657;12851.678708032374;13055.804162937753;13101.475940962255;13230.4046317914;12711;12718.872811271769;12740.936295318465;12852.357382130669;13197.538086166938;11398;11607.535698571963;11744.29534227949;12469.688257793629;12876.806847897476;9462.337636365664;9716.708498745049;9802.85295720579;10082.344647597884;10083.445410502492;10033.498325083863;10423.270371074255;10664.826869044555;10974.451277436256;11545.653630391102 03:39:54 INFO - PROCESS | 29396 | __end_tp_report 03:39:54 INFO - PROCESS | 29396 | __start_cc_report 03:39:54 INFO - PROCESS | 29396 | _x_x_mozilla_cycle_collect,295 03:39:54 INFO - PROCESS | 29396 | __end_cc_report 03:39:54 INFO - PROCESS | 29396 | __startTimestamp1456918794706__endTimestamp 03:39:54 INFO - PROCESS | 29396 | 03:39:54 INFO - PROCESS | 29396 | ------- Summary: start ------- 03:39:54 INFO - PROCESS | 29396 | Number of tests: 6 03:39:54 INFO - PROCESS | 29396 | 03:39:54 INFO - PROCESS | 29396 | [#0] dojo.html Cycles:165 Average:5507.64 Median:5717.40 stddev:609.28 (10.7%) stddev-sans-first:586.92 03:39:54 INFO - PROCESS | 29396 | Values: 3338.8 3343.2 3352.2 3357.6 3388.8 5369.7 5371.0 5395.7 5423.4 5427.3 5417.4 5469.6 5470.6 5473.9 5483.3 4950.7 5006.5 5053.2 5074.6 5138.6 4936.0 4994.9 5077.4 5080.8 5086.2 5060.7 5095.3 5135.7 5137.5 5142.4 5071.5 5090.1 5118.5 5132.2 5140.9 4855.7 4875.1 4936.0 5031.0 5045.8 5202.9 5257.4 5284.7 5284.8 5335.9 5900.3 5915.7 5928.8 5940.8 5946.5 5770.8 5844.0 5934.3 5979.9 5991.3 5602.8 5616.0 5617.0 5631.2 5648.7 6121.1 6131.5 6131.6 6156.8 6165.3 5694.6 5728.2 5863.7 5873.9 5957.9 5910.5 5910.8 5913.4 5920.2 5946.3 5853.0 5891.3 5894.4 5899.4 5905.4 5840.2 5849.5 5915.9 5925.2 5953.6 4511.2 4535.0 4536.8 4544.5 4565.9 4040.6 4083.2 4093.0 4098.7 4122.4 5557.6 5621.3 5623.4 5702.8 5730.8 6003.5 6003.6 6013.6 6025.6 6034.6 5463.5 5621.6 5702.3 5714.1 5715.8 5109.6 5112.1 5131.6 5132.2 5134.0 6066.7 6075.9 6077.9 6105.4 6127.6 5873.0 5886.9 5948.8 5954.0 5974.1 6144.0 6163.8 6175.9 6180.7 6186.1 5912.1 5913.7 5919.1 5945.2 5954.7 5898.2 5900.0 5961.7 5967.2 6012.3 5737.5 5741.1 5760.4 5762.7 5774.6 5717.4 5731.1 5770.8 5773.0 5786.5 5650.5 5666.3 5741.7 5766.0 5768.6 5827.0 5831.1 5838.9 5858.3 5879.1 5660.0 5668.0 5693.2 5699.7 5709.6 03:39:54 INFO - PROCESS | 29396 | 03:39:54 INFO - PROCESS | 29396 | [#1] ext.html Cycles:180 Average:53194.87 Median:22424.10 stddev:101094.25 (450.8%) stddev-sans-first:101300.57 03:39:54 INFO - PROCESS | 29396 | Values: 548.8 556.2 581.8 584.8 622.7 39560.6 39640.6 39725.2 39959.2 40221.2 43381.8 43896.3 43998.3 44104.6 44118.3 8655.7 8956.8 8987.0 8987.3 8989.6 8799.1 8898.6 8903.5 8907.2 8929.0 9091.7 9184.5 9194.7 9203.4 9214.3 9014.8 9106.5 9107.4 9128.3 9155.1 8828.9 8931.5 8948.7 8972.4 8973.4 43077.0 43275.6 43305.1 43309.8 43369.0 3470.7 3717.3 3882.5 4128.2 4233.2 32863.8 32935.3 33133.7 33769.8 34753.7 4006.6 4015.1 4068.9 4095.2 4160.8 285833.0 286510.0 287047.0 287101.0 287384.0 45204.3 45337.8 45591.8 45804.1 64366.4 44174.3 44265.6 44331.3 44337.0 44406.1 15643.8 15664.8 15790.3 15791.1 15860.0 12577.2 12656.5 12753.7 12775.1 12862.7 15416.8 15572.9 15574.2 15588.4 15605.4 6007.6 6079.3 6107.8 6201.5 6228.9 1037.3 1052.8 1117.9 1141.6 1183.4 33483.8 35770.5 36608.8 36835.3 36904.4 1084.4 1133.9 1166.1 1178.1 1240.2 16499.8 16499.8 16556.6 16580.5 16670.7 440758.0 548341.0 548535.0 550646.0 550792.0 55093.2 55964.2 56419.0 56799.7 56920.1 1445.2 1448.2 1456.5 1456.8 1458.1 30675.2 33075.5 33156.0 33335.5 33409.3 50962.0 51273.7 51397.5 51526.5 51702.7 270640.0 270924.0 270973.0 271006.0 271405.0 34670.5 35044.6 35401.5 35459.1 35715.8 46182.5 47031.5 47345.3 47681.3 47914.3 39359.4 39640.0 39918.0 40557.8 40753.0 41773.4 41836.0 43381.8 43877.0 47832.8 41625.4 43446.6 43691.0 44227.6 44760.6 33510.8 35935.5 36434.5 37602.2 38764.6 27655.3 28400.7 28458.4 28727.9 31127.0 03:39:54 INFO - PROCESS | 29396 | 03:39:54 INFO - PROCESS | 29396 | [#2] jquery.html Cycles:180 Average:33457.64 Median:14348.46 stddev:113170.61 (788.7%) stddev-sans-first:113460.84 03:39:54 INFO - PROCESS | 29396 | Values: 391.5 391.6 397.6 400.0 400.3 15268.8 15655.8 17143.3 17745.9 17770.6 12044.6 12305.4 16029.3 17868.6 17877.4 5165.6 5722.5 5763.0 5769.5 5783.6 5318.6 5513.9 5515.8 5518.8 5615.1 5484.4 5505.2 6784.6 7009.8 7037.8 6434.5 6653.0 6991.9 7033.6 7050.0 6317.9 6346.1 6410.8 6448.5 6454.9 21503.2 21838.5 21975.8 24222.2 24535.6 2569.6 2577.4 2608.2 2608.7 2871.4 14186.7 14727.5 14746.6 14972.3 15328.5 2052.9 2079.4 2169.2 2197.0 2224.0 67167.3 68870.0 70800.6 71064.3 71979.3 16203.8 16213.4 16344.8 16364.7 16526.4 25477.1 25539.6 25593.4 26066.1 26088.2 7832.6 7866.7 8118.5 8231.4 8259.0 7703.8 7889.4 7992.9 7999.1 8019.0 4651.8 4714.7 4804.6 4851.3 4866.4 1948.5 1965.3 1970.1 1981.6 1987.1 1004.1 1004.6 1062.2 1073.8 1091.9 17141.7 17182.3 17316.2 17594.4 18312.5 1010.4 1028.9 1041.0 1061.2 1074.2 9703.3 10173.7 10245.3 10310.6 10369.8 683261.0 689413.0 693902.0 699765.0 700762.0 69649.0 76225.0 79240.2 79437.6 82104.0 1206.6 1242.8 1245.0 1250.7 1251.7 16140.0 16243.6 16249.8 16496.9 16535.3 33171.5 33177.0 33937.3 34091.8 34900.5 43159.6 43588.8 45300.3 45605.3 45776.4 7677.7 7875.8 7985.4 7988.8 8014.3 8515.0 10844.0 10860.8 11481.0 11668.7 9523.9 9971.3 10007.4 10677.4 10810.7 7286.3 8244.2 9996.2 10330.4 10558.0 7866.9 8090.6 8191.8 8230.7 8301.6 10210.4 10273.3 10298.1 10308.3 10359.4 10975.7 10994.6 11060.6 11199.6 11275.9 03:39:54 INFO - PROCESS | 29396 | 03:39:54 INFO - PROCESS | 29396 | [#3] mootools.html Cycles:180 Average:5901.18 Median:6556.18 stddev:3053.03 (46.6%) stddev-sans-first:3043.98 03:39:54 INFO - PROCESS | 29396 | Values: 1537.1 1550.1 1796.3 1883.2 1929.5 8209.3 8245.6 8440.9 8469.3 8478.4 8164.3 8185.6 8250.7 8256.2 8273.3 2465.4 2484.9 2494.8 2496.7 2497.5 2499.5 2512.1 2516.1 2520.6 2523.6 2392.4 2439.2 2443.1 2459.0 2482.1 2472.3 2473.3 2494.7 2498.5 2523.9 2447.0 2474.2 2490.7 2498.6 2508.6 8194.6 8288.8 8303.8 8339.7 8343.7 5028.6 5172.8 5192.8 5201.3 5208.8 3214.1 3235.9 3253.2 3260.1 3271.6 1069.9 1118.4 1140.8 1147.0 1147.1 11924.3 11935.0 11954.5 11989.3 12045.0 4466.5 4510.3 4558.3 4567.3 4584.4 9659.5 9679.7 9693.0 9698.4 9702.0 5124.7 5154.3 5159.0 5173.4 5208.8 4754.7 4772.4 4773.4 4780.4 4792.5 3727.1 3850.9 3865.4 3883.5 3891.6 1081.2 1152.6 1176.4 1182.7 1189.6 1128.4 1141.1 1166.5 1172.3 1186.8 7603.5 7654.8 7688.9 7712.7 7761.7 1194.8 1195.6 1199.6 1203.8 1213.5 6028.9 6086.7 6108.9 6131.8 6151.9 9712.0 9896.9 9901.5 9910.6 10063.4 9610.3 9769.8 9795.1 9840.0 9856.4 7716.0 7793.1 7850.4 7865.7 7967.4 7729.8 7830.3 7852.5 7945.0 8150.3 9111.5 9151.7 9172.1 9259.1 9281.9 9270.4 9390.2 9424.1 9431.4 9450.2 7574.1 7700.6 7709.5 7727.5 7728.9 7992.0 8035.3 8126.5 8129.1 8152.7 7660.9 7844.5 7873.6 7884.4 7892.2 7351.7 7450.0 7454.5 7485.6 7498.9 7403.2 7435.3 7469.6 7491.8 7493.3 6960.4 6962.9 7011.2 7016.6 7021.8 6994.9 7061.0 7067.2 7081.3 7164.4 03:39:54 INFO - PROCESS | 29396 | 03:39:54 INFO - PROCESS | 29396 | [#4] prototype.html Cycles:180 Average:5677.67 Median:6394.36 stddev:1717.77 (26.9%) stddev-sans-first:1675.46 03:39:54 INFO - PROCESS | 29396 | Values: 353.6 360.3 362.4 364.8 368.0 6259.8 6268.6 6281.7 6285.1 6371.6 6178.1 6334.6 6339.5 6358.9 6363.7 4906.3 4943.6 4945.3 4948.1 4954.1 4927.8 4930.5 4933.8 4938.2 4956.8 4652.8 4832.3 4834.3 4849.8 4862.9 4807.3 4823.0 4824.1 4834.3 4844.1 4207.1 4216.3 4222.7 4230.2 4233.1 5937.7 6024.6 6026.8 6031.9 6051.2 5643.9 5644.8 5650.2 5654.8 5656.6 6704.1 6737.1 6743.6 6745.6 6754.8 4622.0 4632.1 4647.9 4659.6 4670.9 6869.1 6951.8 6967.0 6982.5 7056.5 4815.8 4835.1 4837.7 4837.8 4842.1 4875.8 4877.9 4883.2 4892.1 4895.6 5538.3 5648.5 5665.2 5665.5 5667.9 6774.1 6787.7 6803.6 6822.5 6830.1 1675.3 1715.4 1715.9 1721.0 1722.3 1132.4 1148.3 1153.6 1165.5 1168.9 6403.8 6407.0 6412.6 6426.9 6433.6 6871.5 6878.6 6896.3 6909.9 6935.7 6384.9 6410.0 6421.8 6436.3 6457.8 3784.2 3809.0 3809.3 3812.4 3815.9 7306.5 7311.8 7320.0 7346.9 7359.2 7145.8 7299.7 7305.6 7310.6 7320.2 7264.3 7298.6 7299.5 7311.4 7314.6 7059.8 7063.2 7091.5 7092.2 7110.0 6744.5 6921.5 6923.2 6974.5 6986.5 7235.4 7276.0 7316.2 7324.1 7345.4 4840.5 4844.6 4844.8 4857.8 4864.9 6832.1 6896.6 7064.8 7068.8 7105.5 6835.3 6855.1 6895.8 6921.1 6934.4 6845.3 6876.6 6883.1 6888.3 6892.1 6598.8 6758.3 6766.7 6767.9 6808.1 6906.9 6924.5 6926.2 6929.8 6931.1 6627.0 6627.0 6634.6 6641.2 6698.0 03:39:54 INFO - PROCESS | 29396 | 03:39:54 INFO - PROCESS | 29396 | [#5] yui.html Cycles:180 Average:14701.47 Median:4641.76 stddev:16677.69 (359.3%) stddev-sans-first:16691.82 03:39:54 INFO - PROCESS | 29396 | Values: 804.2 875.8 882.5 883.6 900.6 14416.3 16159.8 16201.1 16374.3 16379.2 14172.8 14174.8 14188.8 14207.7 14229.2 901.7 904.3 927.0 928.1 929.8 917.0 918.9 919.4 919.7 920.8 953.5 954.8 955.7 958.2 958.5 939.0 942.9 943.6 947.7 948.1 701.5 702.1 706.0 707.8 708.0 14933.9 15052.1 15077.7 15107.5 15158.7 13419.4 13422.3 13497.7 13568.8 13660.4 10914.6 10978.2 11012.8 11088.7 11145.2 3754.3 3776.3 3788.4 3789.3 3811.5 52814.5 53199.7 53232.0 53280.2 53485.5 10738.0 10765.8 10896.0 10956.2 11024.5 19581.7 19584.5 19652.0 19656.0 19662.7 7951.6 8020.6 8058.8 8129.7 8282.8 4528.0 4574.5 4627.1 4656.4 4709.6 3035.6 3077.2 3081.3 3089.5 3093.3 568.9 575.5 580.1 581.3 591.0 547.2 548.6 613.3 621.3 663.2 8931.0 9023.1 9076.4 9114.6 9332.6 621.4 651.4 653.4 710.3 720.0 4150.8 4161.0 4230.5 4230.7 4326.6 55617.0 56076.0 56103.0 60864.4 61299.4 51238.2 51836.7 52209.7 52293.5 55262.0 48257.8 48719.5 49224.3 49452.3 50017.7 9044.6 9297.2 9332.3 9341.1 9516.2 35918.5 35989.5 36027.3 36442.6 36886.9 44200.6 48032.3 48232.8 48249.8 48509.0 10970.8 11182.3 11724.1 11853.5 12247.1 11985.7 13017.7 13234.3 13323.7 13754.7 12840.6 12851.7 13055.8 13101.5 13230.4 12711.0 12718.9 12740.9 12852.4 13197.5 11398.0 11607.5 11744.3 12469.7 12876.8 9462.3 9716.7 9802.9 10082.3 10083.4 10033.5 10423.3 10664.8 10974.5 11545.7 03:39:54 INFO - PROCESS | 29396 | -------- Summary: end -------- 03:39:54 INFO - PROCESS | 29396 | 03:39:55 INFO - TEST-INFO | 29396: exit 0 03:39:55 INFO - TEST-OK | dromaeo_css | took 1108919ms 03:39:55 INFO - TEST-START | kraken 03:39:55 INFO - operating with platform_type : linux_ 03:39:55 INFO - Initialising browser for kraken test... 03:39:55 INFO - TEST-INFO | started process 29639 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpig9RJ2/profile http://localhost:60915/getInfo.html) 03:39:58 INFO - PROCESS | 29639 | 03:39:58 INFO - PROCESS | 29639 | (process:29720): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:39:59 INFO - PROCESS | 29639 | __metrics Screen width/height:1600/1200 03:39:59 INFO - PROCESS | 29639 | colorDepth:24 03:39:59 INFO - PROCESS | 29639 | Browser inner width/height: 1024/697 03:39:59 INFO - PROCESS | 29639 | __metrics 03:40:00 INFO - TEST-INFO | 29639: exit 0 03:40:00 INFO - Browser initialized. 03:40:00 INFO - Running cycle 1/1 for kraken test... 03:40:00 INFO - TEST-INFO | started process 29769 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpig9RJ2/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:40:02 INFO - PROCESS | 29769 | 03:40:02 INFO - PROCESS | 29769 | (process:29830): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:40:12 INFO - PROCESS | 29769 | RSS: Main: 141295616 03:40:12 INFO - PROCESS | 29769 | 03:40:15 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:60915/tests/kraken/driver.html?testName=audio-beat-detection) 03:40:15 INFO - PROCESS | 29769 | RSS: Main: 146243584 03:40:15 INFO - PROCESS | 29769 | 03:40:18 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:60915/tests/kraken/driver.html?testName=audio-dft) 03:40:18 INFO - PROCESS | 29769 | RSS: Main: 147140608 03:40:18 INFO - PROCESS | 29769 | 03:40:21 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:60915/tests/kraken/driver.html?testName=audio-fft) 03:40:22 INFO - PROCESS | 29769 | RSS: Main: 146599936 03:40:22 INFO - PROCESS | 29769 | 03:40:24 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:60915/tests/kraken/driver.html?testName=audio-oscillator) 03:40:25 INFO - PROCESS | 29769 | RSS: Main: 146706432 03:40:25 INFO - PROCESS | 29769 | 03:40:27 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:60915/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:40:27 INFO - PROCESS | 29769 | RSS: Main: 146468864 03:40:27 INFO - PROCESS | 29769 | 03:40:30 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:60915/tests/kraken/driver.html?testName=imaging-darkroom) 03:40:31 INFO - PROCESS | 29769 | RSS: Main: 146059264 03:40:31 INFO - PROCESS | 29769 | 03:40:34 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:60915/tests/kraken/driver.html?testName=imaging-desaturate) 03:40:35 INFO - PROCESS | 29769 | RSS: Main: 145219584 03:40:35 INFO - PROCESS | 29769 | 03:40:38 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:60915/tests/kraken/driver.html?testName=json-parse-financial) 03:40:38 INFO - PROCESS | 29769 | RSS: Main: 145256448 03:40:38 INFO - PROCESS | 29769 | 03:40:40 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:60915/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:40:40 INFO - PROCESS | 29769 | RSS: Main: 145965056 03:40:40 INFO - PROCESS | 29769 | 03:40:42 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:60915/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:40:43 INFO - PROCESS | 29769 | RSS: Main: 147308544 03:40:43 INFO - PROCESS | 29769 | 03:40:45 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:60915/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:40:45 INFO - PROCESS | 29769 | RSS: Main: 147218432 03:40:45 INFO - PROCESS | 29769 | 03:40:48 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:60915/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:40:48 INFO - PROCESS | 29769 | RSS: Main: 145682432 03:40:48 INFO - PROCESS | 29769 | 03:40:51 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:60915/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:40:51 INFO - PROCESS | 29769 | RSS: Main: 147664896 03:40:51 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | Cycle 1(1): loaded http://localhost:60915/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:60915/tests/kraken/driver.html?testName=ai-astar) 03:40:53 INFO - PROCESS | 29769 | RSS: Main: 147525632 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | __start_tp_report 03:40:53 INFO - PROCESS | 29769 | _x_x_mozilla_page_load 03:40:53 INFO - PROCESS | 29769 | _x_x_mozilla_page_load_details 03:40:53 INFO - PROCESS | 29769 | |i|pagename|runs| 03:40:53 INFO - PROCESS | 29769 | |0;ai-astar;110;107;111;109;112;119;112;111;109;108 03:40:53 INFO - PROCESS | 29769 | |1;audio-beat-detection;153;127;155;169;128;147;150;138;158;131 03:40:53 INFO - PROCESS | 29769 | |2;audio-dft;162;161;163;162;163;161;162;161;164;162 03:40:53 INFO - PROCESS | 29769 | |3;audio-fft;76;79;75;153;74;75;76;75;157;75 03:40:53 INFO - PROCESS | 29769 | |4;audio-oscillator;95;96;149;95;96;95;143;99;95;135 03:40:53 INFO - PROCESS | 29769 | |5;imaging-gaussian-blur;110;109;109;109;109;110;109;110;109;110 03:40:53 INFO - PROCESS | 29769 | |6;imaging-darkroom;150;147;147;146;147;146;147;147;147;146 03:40:53 INFO - PROCESS | 29769 | |7;imaging-desaturate;97;96;97;97;97;96;97;97;97;96 03:40:53 INFO - PROCESS | 29769 | |8;json-parse-financial;55;56;55;56;56;57;60;62;53;54 03:40:53 INFO - PROCESS | 29769 | |9;json-stringify-tinderbox;64;65;66;65;65;65;64;64;64;65 03:40:53 INFO - PROCESS | 29769 | |10;stanford-crypto-aes;78;81;80;81;81;78;79;80;84;80 03:40:53 INFO - PROCESS | 29769 | |11;stanford-crypto-ccm;113;111;112;120;113;111;111;132;112;126 03:40:53 INFO - PROCESS | 29769 | |12;stanford-crypto-pbkdf2;142;136;129;129;134;137;135;142;133;137 03:40:53 INFO - PROCESS | 29769 | |13;stanford-crypto-sha256-iterative;67;69;68;65;66;65;71;67;66;68 03:40:53 INFO - PROCESS | 29769 | __end_tp_report 03:40:53 INFO - PROCESS | 29769 | __start_cc_report 03:40:53 INFO - PROCESS | 29769 | _x_x_mozilla_cycle_collect,734 03:40:53 INFO - PROCESS | 29769 | __end_cc_report 03:40:53 INFO - PROCESS | 29769 | __startTimestamp1456918853692__endTimestamp 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | ------- Summary: start ------- 03:40:53 INFO - PROCESS | 29769 | Number of tests: 14 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#0] ai-astar Cycles:10 Average:110.80 Median:111.00 stddev:3.33 (3.0%) stddev-sans-first:3.52 03:40:53 INFO - PROCESS | 29769 | Values: 110.0 107.0 111.0 109.0 112.0 119.0 112.0 111.0 109.0 108.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#1] audio-beat-detection Cycles:10 Average:145.60 Median:151.50 stddev:14.11 (9.3%) stddev-sans-first:14.71 03:40:53 INFO - PROCESS | 29769 | Values: 153.0 127.0 155.0 169.0 128.0 147.0 150.0 138.0 158.0 131.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#2] audio-dft Cycles:10 Average:162.10 Median:162.00 stddev:0.99 (0.6%) stddev-sans-first:1.05 03:40:53 INFO - PROCESS | 29769 | Values: 162.0 161.0 163.0 162.0 163.0 161.0 162.0 161.0 164.0 162.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#3] audio-fft Cycles:10 Average:91.50 Median:75.00 stddev:33.51 (44.7%) stddev-sans-first:35.07 03:40:53 INFO - PROCESS | 29769 | Values: 76.0 79.0 75.0 153.0 74.0 75.0 76.0 75.0 157.0 75.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#4] audio-oscillator Cycles:10 Average:109.80 Median:95.00 stddev:22.72 (23.9%) stddev-sans-first:23.46 03:40:53 INFO - PROCESS | 29769 | Values: 95.0 96.0 149.0 95.0 96.0 95.0 143.0 99.0 95.0 135.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#5] imaging-gaussian-blur Cycles:10 Average:109.40 Median:109.50 stddev:0.52 (0.5%) stddev-sans-first:0.50 03:40:53 INFO - PROCESS | 29769 | Values: 110.0 109.0 109.0 109.0 109.0 110.0 109.0 110.0 109.0 110.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#6] imaging-darkroom Cycles:10 Average:147.00 Median:147.00 stddev:1.15 (0.8%) stddev-sans-first:0.50 03:40:53 INFO - PROCESS | 29769 | Values: 150.0 147.0 147.0 146.0 147.0 146.0 147.0 147.0 147.0 146.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#7] imaging-desaturate Cycles:10 Average:96.70 Median:97.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 03:40:53 INFO - PROCESS | 29769 | Values: 97.0 96.0 97.0 97.0 97.0 96.0 97.0 97.0 97.0 96.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#8] json-parse-financial Cycles:10 Average:56.40 Median:56.00 stddev:2.72 (4.9%) stddev-sans-first:2.83 03:40:53 INFO - PROCESS | 29769 | Values: 55.0 56.0 55.0 56.0 56.0 57.0 60.0 62.0 53.0 54.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#9] json-stringify-tinderbox Cycles:10 Average:64.70 Median:65.00 stddev:0.67 (1.0%) stddev-sans-first:0.67 03:40:53 INFO - PROCESS | 29769 | Values: 64.0 65.0 66.0 65.0 65.0 65.0 64.0 64.0 64.0 65.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#10] stanford-crypto-aes Cycles:10 Average:80.20 Median:80.50 stddev:1.75 (2.2%) stddev-sans-first:1.67 03:40:53 INFO - PROCESS | 29769 | Values: 78.0 81.0 80.0 81.0 81.0 78.0 79.0 80.0 84.0 80.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#11] stanford-crypto-ccm Cycles:10 Average:116.10 Median:113.00 stddev:7.43 (6.6%) stddev-sans-first:7.80 03:40:53 INFO - PROCESS | 29769 | Values: 113.0 111.0 112.0 120.0 113.0 111.0 111.0 132.0 112.0 126.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:135.40 Median:136.50 stddev:4.50 (3.3%) stddev-sans-first:4.09 03:40:53 INFO - PROCESS | 29769 | Values: 142.0 136.0 129.0 129.0 134.0 137.0 135.0 142.0 133.0 137.0 03:40:53 INFO - PROCESS | 29769 | 03:40:53 INFO - PROCESS | 29769 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.20 Median:67.50 stddev:1.87 (2.8%) stddev-sans-first:1.99 03:40:53 INFO - PROCESS | 29769 | Values: 67.0 69.0 68.0 65.0 66.0 65.0 71.0 67.0 66.0 68.0 03:40:53 INFO - PROCESS | 29769 | -------- Summary: end -------- 03:40:53 INFO - PROCESS | 29769 | 03:40:54 INFO - TEST-INFO | 29769: exit 0 03:40:54 INFO - TEST-OK | kraken | took 59223ms 03:40:54 INFO - TEST-START | v8_7 03:40:54 INFO - operating with platform_type : linux_ 03:40:54 INFO - Initialising browser for v8_7 test... 03:40:54 INFO - TEST-INFO | started process 30059 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpzbHJZt/profile http://localhost:60915/getInfo.html) 03:40:58 INFO - PROCESS | 30059 | 03:40:58 INFO - PROCESS | 30059 | (process:30139): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:40:59 INFO - PROCESS | 30059 | __metrics Screen width/height:1600/1200 03:40:59 INFO - PROCESS | 30059 | colorDepth:24 03:40:59 INFO - PROCESS | 30059 | Browser inner width/height: 1024/697 03:40:59 INFO - PROCESS | 30059 | __metrics 03:41:00 INFO - TEST-INFO | 30059: exit 0 03:41:00 INFO - Browser initialized. 03:41:00 INFO - Running cycle 1/1 for v8_7 test... 03:41:00 INFO - TEST-INFO | started process 30188 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpzbHJZt/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:41:01 INFO - PROCESS | 30188 | 03:41:01 INFO - PROCESS | 30188 | (process:30247): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 03:41:11 INFO - PROCESS | 30188 | RSS: Main: 141787136 03:41:11 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | Cycle 1(1): loaded http://localhost:60915/tests/v8_7/run.html (next: http://localhost:60915/tests/v8_7/run.html) 03:41:34 INFO - PROCESS | 30188 | RSS: Main: 145440768 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | __start_tp_report 03:41:34 INFO - PROCESS | 30188 | _x_x_mozilla_page_load 03:41:34 INFO - PROCESS | 30188 | _x_x_mozilla_page_load_details 03:41:34 INFO - PROCESS | 30188 | |i|pagename|runs| 03:41:34 INFO - PROCESS | 30188 | |0;Richards;167.6727028839705 03:41:34 INFO - PROCESS | 30188 | |1;DeltaBlue;172.38407171177383 03:41:34 INFO - PROCESS | 30188 | |2;Encrypt;278.2415136338342 03:41:34 INFO - PROCESS | 30188 | |3;Decrypt;5213.541666666667 03:41:34 INFO - PROCESS | 30188 | |4;RayTrace;913.2420091324201 03:41:34 INFO - PROCESS | 30188 | |5;Earley;545.2562704471102 03:41:34 INFO - PROCESS | 30188 | |6;Boyer;11109.89010989011 03:41:34 INFO - PROCESS | 30188 | |7;RegExp;39442.307692307695 03:41:34 INFO - PROCESS | 30188 | |8;Splay;515.9958720330237 03:41:34 INFO - PROCESS | 30188 | |9;NavierStokes;4812.5 03:41:34 INFO - PROCESS | 30188 | __end_tp_report 03:41:34 INFO - PROCESS | 30188 | __startTimestamp1456918894513__endTimestamp 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | ------- Summary: start ------- 03:41:34 INFO - PROCESS | 30188 | Number of tests: 10 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#0] Richards Cycles:1 Average:167.67 Median:167.67 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 167.7 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#1] DeltaBlue Cycles:1 Average:172.38 Median:172.38 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 172.4 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#2] Encrypt Cycles:1 Average:278.24 Median:278.24 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 278.2 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#3] Decrypt Cycles:1 Average:5213.54 Median:5213.54 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 5213.5 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#4] RayTrace Cycles:1 Average:913.24 Median:913.24 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 913.2 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#5] Earley Cycles:1 Average:545.26 Median:545.26 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 545.3 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#6] Boyer Cycles:1 Average:11109.89 Median:11109.89 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 11109.9 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#7] RegExp Cycles:1 Average:39442.31 Median:39442.31 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 39442.3 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#8] Splay Cycles:1 Average:516.00 Median:516.00 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 516.0 03:41:34 INFO - PROCESS | 30188 | 03:41:34 INFO - PROCESS | 30188 | [#9] NavierStokes Cycles:1 Average:4812.50 Median:4812.50 stddev:0.00 (0.0%) 03:41:34 INFO - PROCESS | 30188 | Values: 4812.5 03:41:34 INFO - PROCESS | 30188 | -------- Summary: end -------- 03:41:34 INFO - PROCESS | 30188 | 03:41:35 INFO - TEST-INFO | 30188: exit 0 03:41:35 INFO - TEST-OK | v8_7 | took 40744ms 03:41:35 INFO - SUITE-END | took 1208s 03:41:35 INFO - Completed test suite (00:20:09) 03:41:35 INFO - Working with test: dromaeo_css 03:41:35 INFO - Generating results file: dromaeo_css 03:41:35 INFO - Working with test: kraken 03:41:35 INFO - Generating results file: kraken 03:41:35 INFO - javascript benchmark 03:41:35 INFO - Working with test: v8_7 03:41:35 INFO - Generating results file: v8_7 03:41:35 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:41:35 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,52,43]] 03:41:35 INFO - process_Request line: dromaeo_css 7422.46 graph.html#tests=[[72,52,43]] 03:41:35 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:41:35 INFO - process_Request line: kraken 1492.90 graph.html#tests=[[232,52,43]] 03:41:35 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 03:41:35 INFO - process_Request line: v8_7 22100.40 graph.html#tests=[[230,52,43]] 03:41:35 INFO - RETURN: dromaeo_css: 7422.46 03:41:35 INFO - RETURN: kraken: 1492.90 03:41:35 INFO - RETURN: v8_7: 22100.40 03:41:35 INFO - javascript benchmark 03:41:35 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3338.8163650999186, 3343.247769251918, 3352.245744707441, 3357.630660627332, 3388.7797293175936, 5369.650972686777, 5370.973145134279, 5395.676259424437, 5423.376311724148, 5427.348718153822, 5417.431169727181, 5469.589780766439, 5470.589705772063, 5473.890522189564, 5483.287172667548, 4950.653454258212, 5006.54941055305, 5053.166227572465, 5074.594032477393, 5138.5889128869785, 4935.950640493603, 4994.850154495371, 5077.441481437039, 5080.84757457275, 5086.21163719624, 5060.671056381342, 5095.286659867622, 5135.743212839362, 5137.460566640505, 5142.408623008346, 5071.518205770446, 5090.109230884599, 5118.488151184889, 5132.204508301219, 5140.948590514103, 4855.708657480563, 4875.098106850244, 4936.037472692827, 5031.0, 5045.848624541233, 5202.869928251824, 5257.395399529065, 5284.735763211824, 5284.762185701653, 5335.919961200585, 5900.262467191601, 5915.674637894914, 5928.7924922627935, 5940.762369505214, 5946.524278057788, 5770.7691692332255, 5843.9707801461145, 5934.258217722785, 5979.850503737398, 5991.310999235056, 5602.803901863415, 5616.045272303718, 5617.0, 5631.211630371751, 5648.661080335193, 6121.143039974407, 6131.540134489931, 6131.6321020738005, 6156.815295541141, 6165.32181460039, 5694.60137790359, 5728.226689396962, 5863.67749773758, 5873.911891321633, 5957.880842383128, 5910.497607703393, 5910.822675319747, 5913.408659134138, 5920.2303700519515, 5946.316173640087, 5852.975729247365, 5891.322497912709, 5894.351621321651, 5899.410058994066, 5905.43898329658, 5840.240768700127, 5849.532037436995, 5915.905557471881, 5925.200097986803, 5953.583249172603, 4511.1654343946475, 4535.047639995571, 4536.750478723702, 4544.522825103382, 4565.885852853705, 4040.616141466556, 4083.183363327287, 4093.038136038029, 4098.692598055098, 4122.42286079949, 5557.638753481011, 5621.269234999424, 5623.437656234344, 5702.7718891243885, 5730.77076916927, 6003.459688628044, 6003.6397816131175, 6013.609115407485, 6025.578209525379, 6034.607750496204, 5463.48096930791, 5621.578381621313, 5702.258706368146, 5714.0571805652435, 5715.799947001835, 5109.591232701375, 5112.079825631422, 5131.589472842164, 5132.230165475134, 5134.024535338349, 6066.726997285133, 6075.939240607626, 6077.878442431127, 6105.358937311607, 6127.571070025145, 5873.0, 5886.911696324644, 5948.762049517971, 5954.0, 5974.074018527135, 6144.003198960267, 6163.753449861955, 6175.938240617536, 6180.6909654517995, 6186.072089186658, 5912.142739302863, 5913.674747888907, 5919.112133180058, 5945.197398351167, 5954.7320370582565, 5898.203742494708, 5899.970500147472, 5961.672108034099, 5967.1944287522365, 6012.3085845126625, 5737.540996720169, 5741.081426971665, 5760.395158508464, 5762.740676669644, 5774.624649397776, 5717.399673034438, 5731.111677689964, 5770.769169233352, 5773.04744717117, 5786.5081468074, 5650.491455769001, 5666.291713535808, 5741.712914354182, 5765.971170144123, 5768.567357448124, 5827.0, 5831.067029275296, 5838.912416313674, 5858.2677165354335, 5879.059350503899, 5660.0, 5668.03643380618, 5693.231413759255, 5699.743511542073, 5709.571782116441], "unit": "score", "name": "dojo.html", "value": 5468.462618302303}, {"lowerIsBetter": false, "replicates": [548.7851760725819, 556.2074044486606, 581.8254523642906, 584.7777844419121, 622.7415622516655, 39560.604393956055, 39640.60359396405, 39725.20549589006, 39959.200815983735, 40221.19557608846, 43381.7830910845, 43896.3415548767, 43998.340024899655, 44104.558954410524, 44118.33822492657, 8655.740327790161, 8956.776080597972, 8987.0, 8987.325950553703, 8989.595468203946, 8799.076097009818, 8898.644054237822, 8903.465792052497, 8907.198352148305, 8928.955355223216, 9091.681791137311, 9184.494852783095, 9194.678186263482, 9203.401778884385, 9214.308926830481, 9014.774630634254, 9106.544672766368, 9107.408018478778, 9128.315376346767, 9155.13026262504, 8828.867566986437, 8931.50876701781, 8948.686795962176, 8972.41679290844, 8973.41672791273, 43077.0, 43275.56724432778, 43305.13389732187, 43309.78345108254, 43369.0, 3470.7396945229207, 3717.275131349388, 3882.456456096149, 4128.2156390285745, 4233.216854881826, 32863.835680821685, 32935.34129317424, 33133.6686633133, 33769.83115084434, 34753.65246347555, 4006.6193711597352, 4015.1166743316426, 4068.9186216275507, 4095.201435720036, 4160.750354978711, 285833.0, 286510.0, 287047.0, 287101.0, 287384.0, 45204.321935171, 45337.77331113389, 45591.77204113958, 45804.08391832211, 64366.35633643697, 44174.33738493925, 44265.557344426146, 44331.33502997458, 44337.0, 44406.11187776226, 15643.843561564467, 15664.843351566566, 15790.289436975363, 15791.131487768283, 15860.0, 12577.182483138567, 12656.493740250287, 12753.744925101446, 12775.105742597929, 12862.67843303925, 15416.768748468781, 15572.909896307376, 15574.221288935509, 15588.376464941275, 15605.3757849687, 6007.639541627516, 6079.331273559905, 6107.816765497042, 6201.503879689614, 6228.906566401508, 1037.2998226197287, 1052.7947050325267, 1117.8770335263114, 1141.57191053355, 1183.3964678014274, 33483.83258083694, 35770.46344304838, 36608.81695591558, 36835.26329473449, 36904.44643330352, 1084.4469320646526, 1133.9489722962487, 1166.1312322319925, 1178.092868491257, 1240.2000709542474, 16499.752503712454, 16499.752503712454, 16556.586085347964, 16580.502584922473, 16670.749938750927, 440758.0, 548341.0, 548535.0, 550646.0, 550792.0, 55093.173602396, 55964.16053759197, 56419.0, 56799.71600141973, 56920.146197807066, 1445.161806152429, 1448.2107251547932, 1456.4611093895326, 1456.766917293228, 1458.1251249250365, 30675.2331191722, 33075.50386744153, 33156.0, 33335.49996750099, 33409.33181336311, 50962.0, 51273.743631281606, 51397.48602513927, 51526.48473515367, 51702.741486292325, 270640.0, 270924.0, 270973.0, 271006.0, 271405.0, 34670.47994280138, 35044.64955350516, 35401.46897796483, 35459.11352216215, 35715.82142089377, 46182.53817461917, 47031.52968470271, 47345.28982065341, 47681.28478072762, 47914.281285781435, 39359.40960885532, 39640.0, 39918.0, 40557.797211014935, 40753.0, 41773.37339939964, 41836.0, 43381.78309108561, 43877.0, 47832.76083619699, 41625.37561936513, 43446.565534345515, 43691.0, 44227.557724422346, 44760.552394475635, 33510.832445837616, 35935.46096808602, 36434.453483198304, 37602.24795504129, 38764.61235387723, 27655.30861728473, 28400.715992839807, 28458.43083138367, 28727.856360718062, 31127.0], "unit": "score", "name": "ext.html", "value": 19596.944849282467}, {"lowerIsBetter": false, "replicates": [391.50865663592197, 391.55362886309604, 397.58055251709436, 399.9940000899987, 400.31745873286053, 15268.84731152688, 15655.843441565581, 17143.314267429305, 17745.911270443645, 17770.555736106602, 12044.57843975461, 12305.384730763448, 16029.278682459288, 17868.64262714745, 17877.374291899785, 5165.560927321173, 5722.484976352128, 5762.97118514409, 5769.480746732793, 5783.5951483396175, 5318.6011049171275, 5513.889722205554, 5515.834524964237, 5518.806841760539, 5615.129654903476, 5484.424135465779, 5505.201745746865, 6784.559003664771, 7009.82475438113, 7037.7536786212495, 6434.453071488929, 6653.035309880089, 6991.930080699179, 7033.577985320871, 7050.0, 6317.925952588071, 6346.11154438379, 6410.775622853178, 6448.54860159789, 6454.93545064548, 21503.2473863414, 21838.454038649, 21975.780242197532, 24222.152224672052, 24535.63196552053, 2569.601711734684, 2577.355661084729, 2608.2175347395705, 2608.699999500063, 2871.3826527296733, 14186.71626567463, 14727.484538041224, 14746.557603271918, 14972.326245318878, 15328.540143795704, 2052.8973551322374, 2079.4177630263553, 2169.197396963118, 2196.9890150549304, 2224.043661225672, 67167.32832671709, 68870.0, 70800.6459967702, 71064.28935710629, 71979.2802071983, 16203.756943645854, 16213.35146594123, 16344.75482867758, 16364.672706545802, 16526.42157524505, 25477.10830120937, 25539.61690574643, 25593.360165995626, 26066.087686930867, 26088.217353479045, 7832.647530861125, 7866.685332586632, 8118.512889226666, 8231.382646301552, 8258.958705206556, 7703.845923081507, 7889.408294377829, 7992.920070799334, 7999.0801057877925, 8018.959905200437, 4651.837185698484, 4714.693544919569, 4804.567588916944, 4851.320815085891, 4866.4403593586485, 1948.4933917181352, 1965.2924947019062, 1970.103602860695, 1981.6333978214077, 1987.125664707524, 1004.0963133180196, 1004.6232662751469, 1062.1821197677746, 1073.7959787640323, 1091.946271847671, 17141.657166856592, 17182.31270749156, 17316.220770065378, 17594.38419655306, 18312.54218644518, 1010.3584224017654, 1028.861103750999, 1041.0, 1061.2200032975757, 1074.1943542343242, 9703.320767546204, 10173.745656358651, 10245.334053286513, 10310.587576497006, 10369.844452333222, 683261.0, 689413.0, 693902.0, 699765.0, 700762.0, 69648.95526567106, 76225.0, 79240.20759792444, 79437.60281198558, 82104.0, 1206.5776978057786, 1242.8322176506238, 1245.0475386329283, 1250.724840535099, 1251.7308778612642, 16140.0, 16243.59391015234, 16249.837501624832, 16496.917515412348, 16535.338586456408, 33171.50242746409, 33177.0, 33937.32125357429, 34091.82954085214, 34900.47649285314, 43159.568404315556, 43588.78205608952, 45300.32049519326, 45605.31592026056, 45776.397826075925, 7677.731279405194, 7875.803104922423, 7985.441019128605, 7988.760337189894, 8014.278714915686, 8514.957425212835, 10844.0, 10860.837087443853, 11481.0, 11668.70828229301, 9523.904760952579, 9971.252156088178, 10007.446755696827, 10677.359358438518, 10810.729731756768, 7286.271372862671, 8244.175582441709, 9996.20030397581, 10330.380177189392, 10558.0, 7866.9213307866185, 8090.555019473985, 8191.79520511992, 8230.670773169006, 8301.626426810688, 10210.438425886647, 10273.332233404804, 10298.124659403735, 10308.278420510493, 10359.430231337348, 10975.725606859893, 10994.560217591206, 11060.557577696802, 11199.552017919192, 11275.887241127484], "unit": "score", "name": "jquery.html", "value": 9288.83284441429}, {"lowerIsBetter": false, "replicates": [1537.085434166671, 1550.062212361521, 1796.2814874050378, 1883.1714045819847, 1929.479040659022, 8209.302209312209, 8245.587720613976, 8440.873386899202, 8469.280111190548, 8478.406511544194, 8164.306033987104, 8185.631646575904, 8250.669973201066, 8256.215659512336, 8273.255407013368, 2465.4452748131707, 2484.8757562121823, 2494.837835540684, 2496.7253602103756, 2497.4505608766044, 2499.525090232859, 2512.1207577347873, 2516.119358224616, 2520.584103622909, 2523.5836087045614, 2392.4258178037235, 2439.207257641274, 2443.108265483095, 2458.9877050614723, 2482.094035676974, 2472.27068014936, 2473.332200305916, 2494.663220465232, 2498.4503409249937, 2523.911663091783, 2447.0, 2474.183519438599, 2490.663760392342, 2498.6376975338476, 2508.648789169518, 8194.590270486451, 8288.751337459886, 8303.792405189919, 8339.708110216174, 8343.666253349858, 5028.572571331441, 5172.818951336685, 5192.766325515361, 5201.271821944931, 5208.8437346879655, 3214.067920303109, 3235.854386552611, 3253.219227385434, 3260.10347154532, 3271.6401195868434, 1069.9437211589554, 1118.3513562133942, 1140.840282360462, 1146.9770604587861, 1147.0651419093413, 11924.284542927453, 11935.045196384268, 11954.521819127225, 11989.340586267752, 12045.0, 4466.531014243523, 4510.323451482304, 4558.293464513005, 4567.2920697291975, 4584.404027476407, 9659.517024148765, 9679.66121185755, 9693.030696930251, 9698.36960597573, 9702.0, 5124.718140502234, 5154.329937108152, 5159.045576568347, 5173.379194496684, 5208.765605547759, 4754.7147171169845, 4772.403449568804, 4773.37946067009, 4780.426348838162, 4792.544708252711, 3727.142757165867, 3850.9037274068373, 3865.362215234511, 3883.5339759229073, 3891.571927088018, 1081.167501024207, 1152.5793085523724, 1176.4000359816555, 1182.6924999500193, 1189.5776999165346, 1128.3850301585492, 1141.1384404774342, 1166.4809159923752, 1172.3083380805365, 1186.833843261944, 7603.543787372775, 7654.8086297843, 7688.923110768821, 7712.7300544481795, 7761.72833950809, 1194.832723418722, 1195.5994741761433, 1199.5501686867424, 1203.8314635950974, 1213.538855235005, 6028.909566356509, 6086.695665216722, 6108.877822443526, 6131.754729810847, 6151.907721384183, 9711.951440242754, 9896.851547226797, 9901.455419951828, 9910.55402506889, 10063.396196228103, 9610.327277090677, 9769.804603908024, 9795.118439340351, 9840.015998400102, 9856.359336643096, 7715.961420192863, 7793.142754297023, 7850.411219158586, 7865.7246996356, 7967.362610991223, 7729.768106956801, 7830.256125668053, 7852.528848269122, 7944.960275198587, 8150.307223886036, 9111.498867562348, 9151.725448236564, 9172.12864777845, 9259.120383563552, 9281.860772088288, 9270.397424167677, 9390.154886060287, 9424.104710052534, 9431.386959847589, 9450.196733277473, 7574.053243344582, 7700.614969251627, 7709.4603377763015, 7727.459077864495, 7728.92271077282, 7992.0, 8035.276825085536, 8126.471779334324, 8129.105798362057, 8152.714654987047, 7660.923390766021, 7844.529328240324, 7873.606319684108, 7884.369250459835, 7892.210778922062, 7351.705931762884, 7450.031495905714, 7454.515456495311, 7485.5508669480005, 7498.925010749823, 7403.185649578434, 7435.330820226206, 7469.626518674153, 7491.812704682427, 7493.325600695964, 6960.443164546926, 6962.930370696228, 7011.193712722898, 7016.5790052597, 7021.754238601625, 6994.9300506996315, 7061.046758687511, 7067.187273463617, 7081.256468070985, 7164.355208031302], "unit": "score", "name": "mootools.html", "value": 4843.402386533247}, {"lowerIsBetter": false, "replicates": [353.63928792631515, 360.3010160289039, 362.41470025908166, 364.84858783604807, 368.01922875536695, 6259.843503912404, 6268.592541484801, 6281.685915704219, 6285.120083188357, 6371.649559274249, 6178.13506109144, 6334.619922804635, 6339.492840572755, 6358.9364106359035, 6363.681815909197, 4906.337644418011, 4943.629227807911, 4945.332380128691, 4948.084604348189, 4954.083494553519, 4927.778249978742, 4930.506949305077, 4933.80264789408, 4938.160512712848, 4956.7769450374635, 4652.837150699726, 4832.323474713543, 4834.283829240604, 4849.806007759703, 4862.878428039309, 4807.254875494304, 4823.0353929214125, 4824.083424149418, 4834.250691142861, 4844.079624871263, 4207.137536804948, 4216.3464662977285, 4222.746635201897, 4230.238557059728, 4233.068724880522, 5937.67342796146, 6024.608400453956, 6026.758929642809, 6031.884101441247, 6051.2133422655215, 5643.887122257532, 5644.8306550803545, 5650.180723795068, 5654.830355089354, 5656.575756818255, 6704.128463299789, 6737.056812046318, 6743.561668491532, 6745.561538499982, 6754.763583274611, 4621.953780462186, 4632.050429661911, 4647.907041859177, 4659.627229821606, 4670.883227919295, 6869.141357330333, 6951.826204344881, 6966.965165174192, 6982.476314276399, 7056.54132481387, 4815.807367705253, 4835.0571638530855, 4837.7097374157665, 4837.830675926326, 4842.055799119138, 4875.756682046126, 4877.878053048631, 4883.194272944925, 4892.119418504703, 4895.583875370562, 5538.335399751975, 5648.5481161507805, 5665.178549110356, 5665.490105890407, 5667.8866422672145, 6774.085498457744, 6787.728490860409, 6803.625800580917, 6822.454203663695, 6830.112085428962, 1675.346614820221, 1715.4167583021833, 1715.8541523970353, 1720.984619074752, 1722.2852516205635, 1132.360216477704, 1148.26511032939, 1153.5904753812445, 1165.516310731037, 1168.8772678868766, 6403.807885763435, 6407.0, 6412.583182093243, 6426.935730642727, 6433.613983161025, 6871.518993670495, 6878.621675807779, 6896.27589103147, 6909.930900691029, 6935.653217339213, 6384.904226436607, 6409.9679501602195, 6421.775237866652, 6436.292007879129, 6457.838554036187, 3784.1863999240295, 3809.0, 3809.257194846978, 3812.390017597171, 3815.942760858534, 7306.452016098814, 7311.817204569822, 7319.963400183072, 7346.853062938711, 7359.153697324876, 7145.821354466076, 7299.70801167958, 7305.634718264066, 7310.597917114504, 7320.194778574352, 7264.346208841124, 7298.56208627484, 7299.489035767445, 7311.3785328247695, 7314.561126332331, 7059.752908648378, 7063.223045464892, 7091.468139889425, 7092.219855815959, 7110.0401445804155, 6744.494162937701, 6921.48088893325, 6923.169219693669, 6974.511784175059, 6986.54587451814, 7235.421166306577, 7276.0, 7316.158641756053, 7324.08448943882, 7345.375643070399, 4840.491748366511, 4844.563989240985, 4844.806207751792, 4857.757112144308, 4864.92702609454, 6832.111825462658, 6896.551724137915, 7064.788056358318, 7068.787936361918, 7105.467089968376, 6835.316468353125, 6855.07456493367, 6895.793126206222, 6921.134858142732, 6934.445244380337, 6845.281245469154, 6876.621785801829, 6883.105196324445, 6888.276730943379, 6892.138482689664, 6598.769043083469, 6758.256591774999, 6766.661666916733, 6767.917133258655, 6808.114945057309, 6906.896396554156, 6924.549904256207, 6926.168859736864, 6929.826754331182, 6931.098957135742, 6626.966865165643, 6626.966865165643, 6634.635095069624, 6641.203055633355, 6697.966510167613], "unit": "score", "name": "prototype.html", "value": 5120.040508428348}, {"lowerIsBetter": false, "replicates": [804.1958041958042, 875.7941883657339, 882.4881568690156, 883.6067949762358, 900.6307413960276, 14416.279186040696, 16159.757603635955, 16201.108939008365, 16374.263158157897, 16379.181040947935, 14172.787408188886, 14174.787378189336, 14188.787168192459, 14207.71584568308, 14229.217393043378, 901.6753968571309, 904.3127223310265, 926.9988412514502, 928.1461055828654, 929.7536152919482, 916.9724908252763, 918.8851393575803, 919.4207649181006, 919.6781126605702, 920.8342498350328, 953.5280036382001, 954.7851733359973, 955.72284037629, 958.2382006305004, 958.4536814016013, 938.9577568898517, 942.8727121838533, 943.5989704375613, 947.6541062512202, 948.0756262643902, 701.5334802356427, 702.0907924238073, 706.0397858911875, 707.7664370757637, 708.019393140499, 14933.850661493463, 15052.096874187475, 15077.698446031127, 15107.4712385066, 15158.696826063417, 13419.396127174301, 13422.261775602436, 13497.730045399136, 13568.796468052988, 13660.385282662304, 10914.563417463292, 10978.231523793338, 11012.779744405147, 11088.667339979733, 11145.1641126915, 3754.286685529768, 3776.2825063237897, 3788.3749181385037, 3789.280036793028, 3811.5045044144085, 52814.47185528172, 53199.73400132974, 53232.0, 53280.20079698808, 53485.465145348826, 10738.0, 10765.83851242232, 10896.0, 10956.178286628376, 11024.50389732464, 19581.706274405897, 19584.510387240432, 19652.0, 19656.0, 19662.70505942412, 7951.562664053533, 8020.639071241808, 8058.758237252775, 8129.674813007414, 8282.8343433131, 4527.977360113178, 4574.45106587205, 4627.120847039052, 4656.3946686930485, 4709.62323014158, 3035.575019497272, 3077.1845460952864, 3081.3221091359865, 3089.5365695145906, 3093.273080826004, 568.8720037991419, 575.4878158438993, 580.1442871764199, 581.2647001543052, 591.0336599659588, 547.1764993684479, 548.6187099965565, 613.2793967088653, 621.2824188062795, 663.1577896071962, 8930.955345223363, 9023.097690230925, 9076.364654474124, 9114.635414583476, 9332.626694932262, 621.4096608222206, 651.3942033908415, 653.3531803514486, 710.2719712294939, 720.0135813934838, 4150.833966641361, 4161.0, 4230.513490948519, 4230.725002874803, 4326.610605045561, 55617.0, 56076.0, 56103.0, 60864.39135608676, 61299.38700612937, 51238.23142652863, 51836.74081629568, 52209.73895130576, 52293.47706522962, 55262.0, 48257.75871120622, 48719.51280487292, 49224.26163607549, 49452.258216126786, 50017.74991125021, 9044.592993315186, 9297.209737172416, 9332.30007749435, 9341.11259430353, 9516.157205240175, 35918.461223082195, 35989.46015809713, 36027.27945441129, 36442.63557364392, 36886.89339319825, 44200.55799441964, 48032.27951580799, 48232.758836206995, 48249.75875120602, 48509.0, 10970.835437468604, 11182.32906025641, 11724.062075034148, 11853.466594003117, 12247.08146888969, 11985.700357490783, 13017.739645206853, 13234.272115033766, 13323.733525329633, 13754.65613359674, 12840.61478155657, 12851.678708032374, 13055.804162937753, 13101.475940962255, 13230.4046317914, 12711.0, 12718.872811271769, 12740.936295318465, 12852.357382130669, 13197.538086166938, 11398.0, 11607.535698571963, 11744.29534227949, 12469.688257793629, 12876.806847897476, 9462.337636365664, 9716.708498745049, 9802.85295720579, 10082.344647597884, 10083.445410502492, 10033.498325083863, 10423.270371074255, 10664.826869044555, 10974.451277436256, 11545.653630391102], "unit": "score", "name": "yui.html", "value": 6773.48104710723}], "name": "dromaeo_css", "value": 7422.458021277219}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 107.0, 111.0, 109.0, 112.0, 119.0, 112.0, 111.0, 109.0, 108.0], "unit": "score", "name": "ai-astar", "value": 110.8}, {"lowerIsBetter": true, "replicates": [153.0, 127.0, 155.0, 169.0, 128.0, 147.0, 150.0, 138.0, 158.0, 131.0], "unit": "score", "name": "audio-beat-detection", "value": 145.6}, {"lowerIsBetter": true, "replicates": [162.0, 161.0, 163.0, 162.0, 163.0, 161.0, 162.0, 161.0, 164.0, 162.0], "unit": "score", "name": "audio-dft", "value": 162.1}, {"lowerIsBetter": true, "replicates": [76.0, 79.0, 75.0, 153.0, 74.0, 75.0, 76.0, 75.0, 157.0, 75.0], "unit": "score", "name": "audio-fft", "value": 91.5}, {"lowerIsBetter": true, "replicates": [95.0, 96.0, 149.0, 95.0, 96.0, 95.0, 143.0, 99.0, 95.0, 135.0], "unit": "score", "name": "audio-oscillator", "value": 109.8}, {"lowerIsBetter": true, "replicates": [110.0, 109.0, 109.0, 109.0, 109.0, 110.0, 109.0, 110.0, 109.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.4}, {"lowerIsBetter": true, "replicates": [150.0, 147.0, 147.0, 146.0, 147.0, 146.0, 147.0, 147.0, 147.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 147.0}, {"lowerIsBetter": true, "replicates": [97.0, 96.0, 97.0, 97.0, 97.0, 96.0, 97.0, 97.0, 97.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.7}, {"lowerIsBetter": true, "replicates": [55.0, 56.0, 55.0, 56.0, 56.0, 57.0, 60.0, 62.0, 53.0, 54.0], "unit": "score", "name": "json-parse-financial", "value": 56.4}, {"lowerIsBetter": true, "replicates": [64.0, 65.0, 66.0, 65.0, 65.0, 65.0, 64.0, 64.0, 64.0, 65.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 64.7}, {"lowerIsBetter": true, "replicates": [78.0, 81.0, 80.0, 81.0, 81.0, 78.0, 79.0, 80.0, 84.0, 80.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.2}, {"lowerIsBetter": true, "replicates": [113.0, 111.0, 112.0, 120.0, 113.0, 111.0, 111.0, 132.0, 112.0, 126.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 116.1}, {"lowerIsBetter": true, "replicates": [142.0, 136.0, 129.0, 129.0, 134.0, 137.0, 135.0, 142.0, 133.0, 137.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 135.4}, {"lowerIsBetter": true, "replicates": [67.0, 69.0, 68.0, 65.0, 66.0, 65.0, 71.0, 67.0, 66.0, 68.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 67.2}], "name": "kraken", "value": 1492.9}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.6727028839705], "unit": "score", "name": "Richards", "value": 210.54112800000007}, {"lowerIsBetter": false, "replicates": [172.38407171177383], "unit": "score", "name": "DeltaBlue", "value": 383.550518}, {"lowerIsBetter": false, "replicates": [278.2415136338342], "unit": "score", "name": "Encrypt", "value": 956.654514}, {"lowerIsBetter": false, "replicates": [5213.541666666667], "unit": "score", "name": "Decrypt", "value": 51.05569630369634}, {"lowerIsBetter": false, "replicates": [913.2420091324201], "unit": "score", "name": "RayTrace", "value": 810.2879549999998}, {"lowerIsBetter": false, "replicates": [545.2562704471102], "unit": "score", "name": "Earley", "value": 1222.2931419999993}, {"lowerIsBetter": false, "replicates": [11109.89010989011], "unit": "score", "name": "Boyer", "value": 59.98826211671617}, {"lowerIsBetter": false, "replicates": [39442.307692307695], "unit": "score", "name": "RegExp", "value": 23.096645538761575}, {"lowerIsBetter": false, "replicates": [515.9958720330237], "unit": "score", "name": "Splay", "value": 157.92955799999993}, {"lowerIsBetter": false, "replicates": [4812.5], "unit": "score", "name": "NavierStokes", "value": 308.3636363636364}], "name": "v8_7", "value": 22100.39845440894}]} 03:41:35 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,52,43]]", "result": "22100.40"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,52,43]]", "result": "1492.90"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,52,43]]", "result": "7422.46"}}} 03:41:35 INFO - Return code: 0 03:41:35 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 03:41:35 INFO - # TBPL SUCCESS # 03:41:35 INFO - Running post-action listener: _resource_record_post_action 03:41:35 INFO - Running post-run listener: _resource_record_post_run 03:41:36 INFO - Total resource usage - Wall time: 1226s; CPU: 13.0%; Read bytes: 290816; Write bytes: 512163840; Read time: 72; Write time: 401228 03:41:36 INFO - install - Wall time: 15s; CPU: 14.0%; Read bytes: 0; Write bytes: 242393088; Read time: 0; Write time: 275912 03:41:37 INFO - run-tests - Wall time: 1211s; CPU: 13.0%; Read bytes: 290816; Write bytes: 269770752; Read time: 72; Write time: 125316 03:41:37 INFO - Running post-run listener: _upload_blobber_files 03:41:37 INFO - Blob upload gear active. 03:41:37 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 03:41:37 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 03:41:37 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'] 03:41:37 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 03:41:37 INFO - (blobuploader) - INFO - Open directory for files ... 03:41:37 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 03:41:37 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:41:37 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:41:38 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 03:41:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:41:38 INFO - (blobuploader) - INFO - Done attempting. 03:41:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 03:41:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:41:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:41:39 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 03:41:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:41:39 INFO - (blobuploader) - INFO - Done attempting. 03:41:39 INFO - (blobuploader) - INFO - Iteration through files over. 03:41:39 INFO - Return code: 0 03:41:39 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 03:41:39 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 03:41:39 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/adcacca1b820037467d1170fcb23dd4d778d3e0452b91700d23e3a134a2ecf4e9a7acfa9a9861be556ed4184f85dd56700a345f88409633b0071a9edc1acad17", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7eb6b97825b9c2d29a57a9f70fbdebda875d697f475755b58937c28ac4079099fec6894e1731a75ba57b3f7746ba9608a0c112714ab759599923529374e14e0b"} 03:41:39 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 03:41:39 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 03:41:39 INFO - Contents: 03:41:39 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/adcacca1b820037467d1170fcb23dd4d778d3e0452b91700d23e3a134a2ecf4e9a7acfa9a9861be556ed4184f85dd56700a345f88409633b0071a9edc1acad17", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7eb6b97825b9c2d29a57a9f70fbdebda875d697f475755b58937c28ac4079099fec6894e1731a75ba57b3f7746ba9608a0c112714ab759599923529374e14e0b"} 03:41:39 INFO - Running post-run listener: copy_logs_to_upload_dir 03:41:39 INFO - Copying logs to upload dir... 03:41:39 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 03:41:39 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1279.620168 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 19 secs) (at 2016-03-02 03:41:38.909712) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-02 03:41:38.915174) ========= 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=a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386 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/adcacca1b820037467d1170fcb23dd4d778d3e0452b91700d23e3a134a2ecf4e9a7acfa9a9861be556ed4184f85dd56700a345f88409633b0071a9edc1acad17", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7eb6b97825b9c2d29a57a9f70fbdebda875d697f475755b58937c28ac4079099fec6894e1731a75ba57b3f7746ba9608a0c112714ab759599923529374e14e0b"} build_url:https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/artifacts/public/build/firefox-46.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011318 build_url: 'https://queue.taskcluster.net/v1/task/ecN41qblTFKJeRO81KL1HQ/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/adcacca1b820037467d1170fcb23dd4d778d3e0452b91700d23e3a134a2ecf4e9a7acfa9a9861be556ed4184f85dd56700a345f88409633b0071a9edc1acad17", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7eb6b97825b9c2d29a57a9f70fbdebda875d697f475755b58937c28ac4079099fec6894e1731a75ba57b3f7746ba9608a0c112714ab759599923529374e14e0b"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-03-02 03:41:38.942517) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-03-02 03:41:38.942844) ========= 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=a0d2d2de893abaa8702a9954000001a7-1456913862.254143-2080765386 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-03-02 03:41:39.022439) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-02 03:41:39.025796) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-03-02 03:41:39.026094) ========= ========= Total master_lag: 0.25 =========