builder: b2g-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-050 starttime: 1453759212.42 results: success (0) buildid: 20160125113022 builduid: 248ea654d41e43d68e7adb4797daedea revision: 247400b48effc0da40642209e34ae4dae37b93ad ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.424776) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.425660) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.426170) ========= 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=6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test-pgo program finished with exit code 0 elapsedTime=0.006302 basedir: '/builds/slave/test-pgo' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.449602) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.449890) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.463174) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.464607) ========= 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=6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004620 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.520856) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.521330) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.521685) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.522382) ========= 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=6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-25 14:00:12-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 27.4M=0s 2016-01-25 14:00:12 (27.4 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.104328 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.647616) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.647904) ========= 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=6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017757 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.700872) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:12.701265) ========= bash -c 'python archiver_client.py mozharness --repo integration/b2g-inbound --rev 247400b48effc0da40642209e34ae4dae37b93ad --destination scripts --debug' in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/b2g-inbound --rev 247400b48effc0da40642209e34ae4dae37b93ad --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=6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-25 14:00:12,961 truncating revision to first 12 chars 2016-01-25 14:00:12,961 Setting DEBUG logging. 2016-01-25 14:00:12,961 attempt 1/10 2016-01-25 14:00:12,961 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/b2g-inbound/247400b48eff?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-25 14:00:13,226 unpacking tar archive at: b2g-inbound-247400b48eff/testing/mozharness/ program finished with exit code 0 elapsedTime=0.535459 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:13.250820) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:13.251174) ========= echo 247400b48effc0da40642209e34ae4dae37b93ad in dir /builds/slave/test-pgo/. (timeout 1200 secs) watching logfiles {} argv: ['echo', u'247400b48effc0da40642209e34ae4dae37b93ad'] 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=6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 247400b48effc0da40642209e34ae4dae37b93ad program finished with exit code 0 elapsedTime=0.003348 script_repo_revision: '247400b48effc0da40642209e34ae4dae37b93ad' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:13.299163) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:13.299517) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-25 14:00:13.309429) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-01-25 14:00:13.309855) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound in dir /builds/slave/test-pgo/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'B2G-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'B2G-Inbound'] 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=6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 14:00:13 INFO - MultiFileLogger online at 20160125 14:00:13 in /builds/slave/test-pgo 14:00:13 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name B2G-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch B2G-Inbound 14:00:13 INFO - Dumping config to /builds/slave/test-pgo/logs/localconfig.json. 14:00:13 INFO - {'append_to_log': False, 14:00:13 INFO - 'base_work_dir': '/builds/slave/test-pgo', 14:00:13 INFO - 'blob_upload_branch': 'B2G-Inbound', 14:00:13 INFO - 'blob_uploader_auth_file': '/builds/slave/test-pgo/oauth.txt', 14:00:13 INFO - 'branch': 'B2G-Inbound', 14:00:13 INFO - 'buildbot_json_path': 'buildprops.json', 14:00:13 INFO - 'config_files': ('talos/linux_config.py',), 14:00:13 INFO - 'default_actions': ('clobber', 14:00:13 INFO - 'read-buildbot-config', 14:00:13 INFO - 'download-and-extract', 14:00:13 INFO - 'populate-webroot', 14:00:13 INFO - 'create-virtualenv', 14:00:13 INFO - 'install', 14:00:13 INFO - 'run-tests'), 14:00:13 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 14:00:13 INFO - 'download_minidump_stackwalk': True, 14:00:13 INFO - 'download_symbols': 'ondemand', 14:00:13 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 14:00:13 INFO - 'tooltool.py': '/tools/tooltool.py', 14:00:13 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 14:00:13 INFO - '/tools/misc-python/virtualenv.py')}, 14:00:13 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 14:00:13 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 14:00:13 INFO - 'installer_path': 'installer.exe', 14:00:13 INFO - 'log_level': 'info', 14:00:13 INFO - 'log_name': 'talos', 14:00:13 INFO - 'log_to_console': True, 14:00:13 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 14:00:13 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 14:00:13 INFO - 'opt_config_files': (), 14:00:13 INFO - 'pip_index': False, 14:00:13 INFO - 'sps_profile': False, 14:00:13 INFO - 'sps_profile_interval': 0, 14:00:13 INFO - 'suite': 'dromaeojs', 14:00:13 INFO - 'system_bits': '32', 14:00:13 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 14:00:13 INFO - 'title': 'talos-linux64-ix-050', 14:00:13 INFO - 'tooltool_cache': '/builds/tooltool_cache', 14:00:13 INFO - 'use_talos_json': True, 14:00:13 INFO - 'virtualenv_path': '/builds/slave/test-pgo/build/venv', 14:00:13 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 14:00:13 INFO - 'work_dir': 'build'} 14:00:13 INFO - ##### 14:00:13 INFO - ##### Running clobber step. 14:00:13 INFO - ##### 14:00:13 INFO - Running pre-action listener: _resource_record_pre_action 14:00:13 INFO - Running main action method: clobber 14:00:13 INFO - rmtree: /builds/slave/test-pgo/build 14:00:13 INFO - retry: Calling rmtree with args: ('/builds/slave/test-pgo/build',), kwargs: {}, attempt #1 14:00:14 INFO - Running post-action listener: _resource_record_post_action 14:00:14 INFO - ##### 14:00:14 INFO - ##### Running read-buildbot-config step. 14:00:14 INFO - ##### 14:00:14 INFO - Running pre-action listener: _resource_record_pre_action 14:00:14 INFO - Running main action method: read_buildbot_config 14:00:14 INFO - Using buildbot properties: 14:00:14 INFO - { 14:00:14 INFO - "project": "", 14:00:14 INFO - "product": "firefox", 14:00:14 INFO - "script_repo_revision": "production", 14:00:14 INFO - "builddir": "b2g-inbound_ubuntu64_hw_test-dromaeojs", 14:00:14 INFO - "repository": "", 14:00:14 INFO - "buildername": "Ubuntu HW 12.04 x64 b2g-inbound pgo talos dromaeojs", 14:00:14 INFO - "buildid": "20160125113022", 14:00:14 INFO - "pgo_build": "True", 14:00:14 INFO - "basedir": "/builds/slave/test-pgo", 14:00:14 INFO - "buildnumber": 232, 14:00:14 INFO - "slavename": "talos-linux64-ix-050", 14:00:14 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 14:00:14 INFO - "platform": "ubuntu64_hw", 14:00:14 INFO - "scheduler": "tests-b2g-inbound-linux64-pgo-talos", 14:00:14 INFO - "branch": "b2g-inbound", 14:00:14 INFO - "repo_path": "integration/b2g-inbound", 14:00:14 INFO - "revision": "247400b48effc0da40642209e34ae4dae37b93ad", 14:00:14 INFO - "stage_platform": "linux64-pgo", 14:00:14 INFO - "builduid": "248ea654d41e43d68e7adb4797daedea", 14:00:14 INFO - "slavebuilddir": "test" 14:00:14 INFO - } 14:00:14 INFO - Found installer url https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 14:00:14 INFO - Running post-action listener: _resource_record_post_action 14:00:14 INFO - ##### 14:00:14 INFO - ##### Running download-and-extract step. 14:00:14 INFO - ##### 14:00:14 INFO - Running pre-action listener: _resource_record_pre_action 14:00:14 INFO - Running main action method: download_and_extract 14:00:14 INFO - mkdir: /builds/slave/test-pgo/build/tests 14:00:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:14 INFO - https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 14:00:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/test_packages.json 14:00:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/test_packages.json 14:00:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/test_packages.json to /builds/slave/test-pgo/build/test_packages.json 14:00:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test-pgo/build/test_packages.json'}, attempt #1 14:00:14 INFO - Downloaded 1448 bytes. 14:00:14 INFO - Reading from file /builds/slave/test-pgo/build/test_packages.json 14:00:14 INFO - Using the following test package requirements: 14:00:14 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 14:00:14 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 14:00:14 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 14:00:14 INFO - u'gtest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 14:00:14 INFO - u'firefox-46.0a1.en-US.linux-x86_64.gtest.tests.zip'], 14:00:14 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 14:00:14 INFO - u'jsshell-linux-x86_64.zip'], 14:00:14 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 14:00:14 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 14:00:14 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 14:00:14 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 14:00:14 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 14:00:14 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 14:00:14 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 14:00:14 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 14:00:14 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 14:00:14 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 14:00:14 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 14:00:14 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 14:00:14 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 14:00:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:14 INFO - https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 14:00:14 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 14:00:14 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 14:00:14 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 14:00:14 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:00:15 INFO - Downloaded 22494316 bytes. 14:00:15 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 14:00:15 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 14:00:17 INFO - Return code: 0 14:00:17 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 14:00:17 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')]} 14:00:17 INFO - https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 14:00:17 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 14:00:17 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 14:00:17 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 14:00:17 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 14:00:18 INFO - Downloaded 22494316 bytes. 14:00:18 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 14:00:18 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test-pgo/build/tests 14:00:19 INFO - Return code: 0 14:00:19 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')]} 14:00:19 INFO - https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 14:00:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 14:00:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 14:00:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 14:00:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 14:00:21 INFO - Downloaded 10706572 bytes. 14:00:21 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test-pgo/build/tests'] 14:00:21 INFO - Copy/paste: unzip -q -o /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test-pgo/build/tests 14:00:21 INFO - Return code: 0 14:00:21 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')]} 14:00:21 INFO - https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 14:00:21 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 14:00:21 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 14:00:21 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 14:00:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 14:00:24 INFO - Downloaded 55988730 bytes. 14:00:24 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 14:00:24 INFO - mkdir: /builds/slave/test-pgo/properties 14:00:24 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test-pgo/properties/build_url 14:00:24 INFO - Writing to file /builds/slave/test-pgo/properties/build_url 14:00:24 INFO - Contents: 14:00:24 INFO - build_url:https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 14:00:24 INFO - Running post-action listener: _resource_record_post_action 14:00:24 INFO - Running post-action listener: set_extra_try_arguments 14:00:24 INFO - ##### 14:00:24 INFO - ##### Running populate-webroot step. 14:00:24 INFO - ##### 14:00:24 INFO - Running pre-action listener: _resource_record_pre_action 14:00:24 INFO - Running main action method: populate_webroot 14:00:24 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 14:00:24 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 14:00:24 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 14:00:24 INFO - '--tppagecycles', 14:00:24 INFO - '7'], 14:00:24 INFO - 'tests': ['tsvgm']}}, 14:00:24 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 14:00:24 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 14:00:24 INFO - 'tests': ['tresize', 'tcanvasmark']}, 14:00:24 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 14:00:24 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 14:00:24 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 14:00:24 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:00:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:00:24 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:00:24 INFO - 'talos_options': ['--e10s'], 14:00:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 14:00:24 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:00:24 INFO - 'tests': ['damp', 'tps']}, 14:00:24 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:00:24 INFO - 'talos_options': ['--e10s'], 14:00:24 INFO - 'tests': ['damp', 'tps']}, 14:00:24 INFO - 'g3': {'tests': ['dromaeo_dom']}, 14:00:24 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 14:00:24 INFO - 'other': {'tests': ['a11yr', 14:00:24 INFO - 'ts_paint', 14:00:24 INFO - 'tpaint', 14:00:24 INFO - 'sessionrestore', 14:00:24 INFO - 'sessionrestore_no_auto_restore']}, 14:00:24 INFO - 'other-e10s': {'talos_options': ['--e10s'], 14:00:24 INFO - 'tests': ['a11yr', 14:00:24 INFO - 'ts_paint', 14:00:24 INFO - 'tpaint', 14:00:24 INFO - 'sessionrestore', 14:00:24 INFO - 'sessionrestore_no_auto_restore']}, 14:00:24 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 14:00:24 INFO - 'tests': ['a11yr', 14:00:24 INFO - 'ts_paint', 14:00:24 INFO - 'tpaint', 14:00:24 INFO - 'sessionrestore', 14:00:24 INFO - 'sessionrestore_no_auto_restore']}, 14:00:24 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 14:00:24 INFO - 'tests': ['a11yr', 14:00:24 INFO - 'ts_paint', 14:00:24 INFO - 'tpaint', 14:00:24 INFO - 'sessionrestore', 14:00:24 INFO - 'sessionrestore_no_auto_restore']}, 14:00:24 INFO - 'other_l64': {'tests': ['a11yr', 14:00:24 INFO - 'ts_paint', 14:00:24 INFO - 'tpaint', 14:00:24 INFO - 'sessionrestore', 14:00:24 INFO - 'sessionrestore_no_auto_restore']}, 14:00:24 INFO - 'other_nol64': {'tests': ['a11yr', 14:00:24 INFO - 'ts_paint', 14:00:24 INFO - 'tpaint', 14:00:24 INFO - 'sessionrestore', 14:00:24 INFO - 'sessionrestore_no_auto_restore']}, 14:00:24 INFO - 'svgr': {'tests': ['tsvgx', 14:00:24 INFO - 'tsvgr_opacity', 14:00:24 INFO - 'tart', 14:00:24 INFO - 'tscrollx', 14:00:24 INFO - 'cart']}, 14:00:24 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 14:00:24 INFO - 'tests': ['tsvgx', 14:00:24 INFO - 'tsvgr_opacity', 14:00:24 INFO - 'tart', 14:00:24 INFO - 'tscrollx', 14:00:24 INFO - 'cart']}, 14:00:24 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:00:24 INFO - 'tests': ['tp5o']}, 14:00:24 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:00:24 INFO - 'talos_options': ['--e10s'], 14:00:24 INFO - 'tests': ['tp5o']}, 14:00:24 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:00:24 INFO - 'talos_options': ['--xperf_path', 14:00:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:00:24 INFO - 'tests': ['tp5n']}, 14:00:24 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 14:00:24 INFO - 'talos_options': ['--e10s', 14:00:24 INFO - '--xperf_path', 14:00:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 14:00:24 INFO - 'tests': ['tp5n']}}, 14:00:24 INFO - 'talos.zip': {'path': '', 14:00:24 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 14:00:24 INFO - Running post-action listener: _resource_record_post_action 14:00:24 INFO - ##### 14:00:24 INFO - ##### Running create-virtualenv step. 14:00:24 INFO - ##### 14:00:24 INFO - Running pre-action listener: _resource_record_pre_action 14:00:24 INFO - Running main action method: create_virtualenv 14:00:24 INFO - Creating virtualenv /builds/slave/test-pgo/build/venv 14:00:24 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 14:00:24 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test-pgo/build/venv 14:00:25 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 14:00:25 INFO - Using real prefix '/usr' 14:00:25 INFO - New python executable in /builds/slave/test-pgo/build/venv/bin/python 14:00:25 INFO - Installing distribute.............................................................................................................................................................................................done. 14:00:27 INFO - Installing pip.................done. 14:00:27 INFO - Return code: 0 14:00:27 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test-pgo/build/venv 14:00:27 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')]} 14:00:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:00:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:27 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')]} 14:00:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:00:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:27 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 0x7fcdf4aabf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1669560>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, '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': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', '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 14:00:27 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 14:00:27 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 14:00:27 INFO - Using env: {'DISPLAY': ':0', 14:00:27 INFO - 'HOME': '/home/cltbld', 14:00:27 INFO - 'LANG': 'en_US.UTF-8', 14:00:27 INFO - 'LANGUAGE': 'en_US:en', 14:00:27 INFO - 'LOGNAME': 'cltbld', 14:00:27 INFO - 'MAIL': '/var/mail/cltbld', 14:00:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:00:27 INFO - 'MOZ_NO_REMOTE': '1', 14:00:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:00:27 INFO - 'NO_EM_RESTART': '1', 14:00:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:00:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:00:27 INFO - 'PWD': '/builds/slave/test-pgo', 14:00:27 INFO - 'SHELL': '/bin/bash', 14:00:27 INFO - 'SHLVL': '1', 14:00:27 INFO - 'TERM': 'linux', 14:00:27 INFO - 'TMOUT': '86400', 14:00:27 INFO - 'USER': 'cltbld', 14:00:27 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:00:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:00:27 INFO - '_': '/tools/buildbot/bin/python'} 14:00:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:00:27 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 14:00:27 INFO - Cleaning up... 14:00:27 INFO - Return code: 0 14:00:27 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test-pgo/build/venv 14:00:27 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')]} 14:00:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:00:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:27 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')]} 14:00:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:00:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:27 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 0x7fcdf4aabf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1669560>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, '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': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', '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 14:00:27 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 14:00:27 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 14:00:27 INFO - Using env: {'DISPLAY': ':0', 14:00:27 INFO - 'HOME': '/home/cltbld', 14:00:27 INFO - 'LANG': 'en_US.UTF-8', 14:00:27 INFO - 'LANGUAGE': 'en_US:en', 14:00:27 INFO - 'LOGNAME': 'cltbld', 14:00:27 INFO - 'MAIL': '/var/mail/cltbld', 14:00:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:00:27 INFO - 'MOZ_NO_REMOTE': '1', 14:00:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:00:27 INFO - 'NO_EM_RESTART': '1', 14:00:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:00:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:00:27 INFO - 'PWD': '/builds/slave/test-pgo', 14:00:27 INFO - 'SHELL': '/bin/bash', 14:00:27 INFO - 'SHLVL': '1', 14:00:27 INFO - 'TERM': 'linux', 14:00:27 INFO - 'TMOUT': '86400', 14:00:27 INFO - 'USER': 'cltbld', 14:00:27 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:00:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:00:27 INFO - '_': '/tools/buildbot/bin/python'} 14:00:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:00:27 INFO - Downloading/unpacking psutil>=0.7.1 14:00:27 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 14:00:27 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 14:00:27 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 14:00:27 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 14:00:27 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 14:00:27 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 14:00:29 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/psutil/setup.py) egg_info for package psutil 14:00:29 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:00:29 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:00:29 INFO - Installing collected packages: psutil 14:00:29 INFO - Running setup.py install for psutil 14:00:29 INFO - building 'psutil._psutil_linux' extension 14:00:29 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 14:00:30 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 14:00:30 INFO - building 'psutil._psutil_posix' extension 14:00:30 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 14:00:30 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 14:00:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 14:00:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 14:00:30 INFO - Successfully installed psutil 14:00:30 INFO - Cleaning up... 14:00:30 INFO - Return code: 0 14:00:30 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test-pgo/build/venv 14:00:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:00:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:00:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:30 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 0x7fcdf4aabf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1669560>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, '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': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', '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 14:00:30 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 14:00:30 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 14:00:30 INFO - Using env: {'DISPLAY': ':0', 14:00:30 INFO - 'HOME': '/home/cltbld', 14:00:30 INFO - 'LANG': 'en_US.UTF-8', 14:00:30 INFO - 'LANGUAGE': 'en_US:en', 14:00:30 INFO - 'LOGNAME': 'cltbld', 14:00:30 INFO - 'MAIL': '/var/mail/cltbld', 14:00:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:00:30 INFO - 'MOZ_NO_REMOTE': '1', 14:00:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:00:30 INFO - 'NO_EM_RESTART': '1', 14:00:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:00:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:00:30 INFO - 'PWD': '/builds/slave/test-pgo', 14:00:30 INFO - 'SHELL': '/bin/bash', 14:00:30 INFO - 'SHLVL': '1', 14:00:30 INFO - 'TERM': 'linux', 14:00:30 INFO - 'TMOUT': '86400', 14:00:30 INFO - 'USER': 'cltbld', 14:00:30 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:00:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:00:30 INFO - '_': '/tools/buildbot/bin/python'} 14:00:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:00:30 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 14:00:30 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 14:00:30 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 14:00:30 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 14:00:30 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 14:00:30 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 14:00:30 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 14:00:32 INFO - Downloading mozsystemmonitor-0.0.tar.gz 14:00:32 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 14:00:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 14:00:32 INFO - Installing collected packages: mozsystemmonitor 14:00:32 INFO - Running setup.py install for mozsystemmonitor 14:00:32 INFO - Successfully installed mozsystemmonitor 14:00:32 INFO - Cleaning up... 14:00:32 INFO - Return code: 0 14:00:32 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test-pgo/build/venv 14:00:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:00:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:00:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:32 INFO - retry: Calling run_command with args: [['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fcdf4aabf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1669560>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, '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': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', '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 14:00:32 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test-pgo/build 14:00:32 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 14:00:32 INFO - Using env: {'DISPLAY': ':0', 14:00:32 INFO - 'HOME': '/home/cltbld', 14:00:32 INFO - 'LANG': 'en_US.UTF-8', 14:00:32 INFO - 'LANGUAGE': 'en_US:en', 14:00:32 INFO - 'LOGNAME': 'cltbld', 14:00:32 INFO - 'MAIL': '/var/mail/cltbld', 14:00:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:00:32 INFO - 'MOZ_NO_REMOTE': '1', 14:00:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:00:32 INFO - 'NO_EM_RESTART': '1', 14:00:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:00:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:00:32 INFO - 'PWD': '/builds/slave/test-pgo', 14:00:32 INFO - 'SHELL': '/bin/bash', 14:00:32 INFO - 'SHLVL': '1', 14:00:32 INFO - 'TERM': 'linux', 14:00:32 INFO - 'TMOUT': '86400', 14:00:32 INFO - 'USER': 'cltbld', 14:00:32 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:00:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:00:32 INFO - '_': '/tools/buildbot/bin/python'} 14:00:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:00:32 INFO - Downloading/unpacking blobuploader==1.2.4 14:00:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:00:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:00:32 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:00:32 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:00:32 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:00:32 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:00:34 INFO - Downloading blobuploader-1.2.4.tar.gz 14:00:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 14:00:34 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 14:00:34 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 14:00:34 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 14:00:34 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 14:00:34 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 14:00:34 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 14:00:34 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 14:00:34 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/requests/setup.py) egg_info for package requests 14:00:35 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 14:00:35 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 14:00:35 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 14:00:35 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 14:00:35 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 14:00:35 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 14:00:35 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 14:00:35 INFO - Downloading docopt-0.6.1.tar.gz 14:00:35 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/docopt/setup.py) egg_info for package docopt 14:00:35 INFO - Installing collected packages: blobuploader, requests, docopt 14:00:35 INFO - Running setup.py install for blobuploader 14:00:35 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 14:00:35 INFO - changing mode of /builds/slave/test-pgo/build/venv/bin/blobberc.py to 775 14:00:35 INFO - Running setup.py install for requests 14:00:35 INFO - Running setup.py install for docopt 14:00:35 INFO - Successfully installed blobuploader requests docopt 14:00:35 INFO - Cleaning up... 14:00:35 INFO - Return code: 0 14:00:35 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 14:00:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:00:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:00:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:35 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 0x7fcdf4aabf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1669560>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, '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': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', '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 14:00:35 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 14:00:35 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 14:00:35 INFO - Using env: {'DISPLAY': ':0', 14:00:35 INFO - 'HOME': '/home/cltbld', 14:00:35 INFO - 'LANG': 'en_US.UTF-8', 14:00:35 INFO - 'LANGUAGE': 'en_US:en', 14:00:35 INFO - 'LOGNAME': 'cltbld', 14:00:35 INFO - 'MAIL': '/var/mail/cltbld', 14:00:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:00:35 INFO - 'MOZ_NO_REMOTE': '1', 14:00:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:00:35 INFO - 'NO_EM_RESTART': '1', 14:00:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:00:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:00:35 INFO - 'PWD': '/builds/slave/test-pgo', 14:00:35 INFO - 'SHELL': '/bin/bash', 14:00:35 INFO - 'SHLVL': '1', 14:00:35 INFO - 'TERM': 'linux', 14:00:35 INFO - 'TMOUT': '86400', 14:00:35 INFO - 'USER': 'cltbld', 14:00:35 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:00:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:00:35 INFO - '_': '/tools/buildbot/bin/python'} 14:00:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 14:00:36 INFO - Running setup.py (path:/tmp/pip-0NGO10-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 14:00:36 INFO - Running setup.py (path:/tmp/pip-TrwwyG-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 14:00:36 INFO - Running setup.py (path:/tmp/pip-gjb5Go-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 14:00:36 INFO - Running setup.py (path:/tmp/pip-yM3N5_-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 14:00:36 INFO - Running setup.py (path:/tmp/pip-OYNxC8-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 14:00:36 INFO - Running setup.py (path:/tmp/pip-hpjHaO-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 14:00:36 INFO - Running setup.py (path:/tmp/pip-noePDM-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 14:00:36 INFO - Running setup.py (path:/tmp/pip-BclK5N-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 14:00:36 INFO - Running setup.py (path:/tmp/pip-aJlR4J-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 14:00:36 INFO - Running setup.py (path:/tmp/pip-PGGt4U-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 14:00:36 INFO - Running setup.py (path:/tmp/pip-Svvq9V-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 14:00:36 INFO - Running setup.py (path:/tmp/pip-O9_YVm-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 14:00:36 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 14:00:36 INFO - Running setup.py (path:/tmp/pip-W92u03-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 14:00:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 14:00:37 INFO - Running setup.py (path:/tmp/pip-1XhoYb-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 14:00:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 14:00:37 INFO - Running setup.py (path:/tmp/pip-VpNCzl-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 14:00:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 14:00:37 INFO - Running setup.py (path:/tmp/pip-fePqf0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 14:00:37 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 14:00:37 INFO - Running setup.py (path:/tmp/pip-5ySObo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 14:00:37 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 14:00:37 INFO - Running setup.py install for manifestparser 14:00:37 INFO - Installing manifestparser script to /builds/slave/test-pgo/build/venv/bin 14:00:37 INFO - Running setup.py install for mozcrash 14:00:37 INFO - Running setup.py install for mozdebug 14:00:37 INFO - Running setup.py install for mozdevice 14:00:37 INFO - Installing sutini script to /builds/slave/test-pgo/build/venv/bin 14:00:37 INFO - Installing dm script to /builds/slave/test-pgo/build/venv/bin 14:00:37 INFO - Running setup.py install for mozfile 14:00:37 INFO - Running setup.py install for mozhttpd 14:00:37 INFO - Installing mozhttpd script to /builds/slave/test-pgo/build/venv/bin 14:00:37 INFO - Running setup.py install for mozinfo 14:00:38 INFO - Installing mozinfo script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Running setup.py install for mozInstall 14:00:38 INFO - Installing moz_remove_from_system script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Installing mozuninstall script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Installing mozinstall script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Installing moz_add_to_system script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Running setup.py install for mozleak 14:00:38 INFO - Running setup.py install for mozlog 14:00:38 INFO - Installing structlog script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Running setup.py install for moznetwork 14:00:38 INFO - Installing moznetwork script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Running setup.py install for mozprocess 14:00:38 INFO - Running setup.py install for mozprofile 14:00:38 INFO - Installing mozprofile script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Installing diff-profiles script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Installing view-profile script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Running setup.py install for mozrunner 14:00:38 INFO - Installing mozrunner script to /builds/slave/test-pgo/build/venv/bin 14:00:38 INFO - Running setup.py install for mozscreenshot 14:00:38 INFO - Running setup.py install for moztest 14:00:38 INFO - Running setup.py install for mozversion 14:00:39 INFO - Installing mozversion script to /builds/slave/test-pgo/build/venv/bin 14:00:39 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 14:00:39 INFO - Cleaning up... 14:00:39 INFO - Return code: 0 14:00:39 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 14:00:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:00:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:00:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:39 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 0x7fcdf4aabf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1669560>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, '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': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', '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 14:00:39 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 14:00:39 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 14:00:39 INFO - Using env: {'DISPLAY': ':0', 14:00:39 INFO - 'HOME': '/home/cltbld', 14:00:39 INFO - 'LANG': 'en_US.UTF-8', 14:00:39 INFO - 'LANGUAGE': 'en_US:en', 14:00:39 INFO - 'LOGNAME': 'cltbld', 14:00:39 INFO - 'MAIL': '/var/mail/cltbld', 14:00:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:00:39 INFO - 'MOZ_NO_REMOTE': '1', 14:00:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:00:39 INFO - 'NO_EM_RESTART': '1', 14:00:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:00:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:00:39 INFO - 'PWD': '/builds/slave/test-pgo', 14:00:39 INFO - 'SHELL': '/bin/bash', 14:00:39 INFO - 'SHLVL': '1', 14:00:39 INFO - 'TERM': 'linux', 14:00:39 INFO - 'TMOUT': '86400', 14:00:39 INFO - 'USER': 'cltbld', 14:00:39 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:00:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:00:39 INFO - '_': '/tools/buildbot/bin/python'} 14:00:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/manifestparser 14:00:39 INFO - Running setup.py (path:/tmp/pip-0_Yzy0-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/manifestparser 14:00:39 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)) 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozcrash 14:00:39 INFO - Running setup.py (path:/tmp/pip-KtWTAY-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozcrash 14:00:39 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)) 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdebug 14:00:39 INFO - Running setup.py (path:/tmp/pip-K923Zq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdebug 14:00:39 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)) 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozdevice 14:00:39 INFO - Running setup.py (path:/tmp/pip-pHZ9Oc-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozdevice 14:00:39 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)) 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozfile 14:00:39 INFO - Running setup.py (path:/tmp/pip-OBgJGz-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozfile 14:00:39 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)) 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozhttpd 14:00:39 INFO - Running setup.py (path:/tmp/pip-hW62FS-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozhttpd 14:00:39 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)) 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinfo 14:00:39 INFO - Running setup.py (path:/tmp/pip-iugsOw-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinfo 14:00:39 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)) 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozinstall 14:00:39 INFO - Running setup.py (path:/tmp/pip-Dl1WpI-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozinstall 14:00:39 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)) 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozleak 14:00:39 INFO - Running setup.py (path:/tmp/pip-SWAtDd-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozleak 14:00:39 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)) 14:00:39 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozlog 14:00:39 INFO - Running setup.py (path:/tmp/pip-HHWR_f-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozlog 14:00:40 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)) 14:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moznetwork 14:00:40 INFO - Running setup.py (path:/tmp/pip-iVwMVn-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moznetwork 14:00:40 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)) 14:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprocess 14:00:40 INFO - Running setup.py (path:/tmp/pip-OxjtVo-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprocess 14:00:40 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)) 14:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozprofile 14:00:40 INFO - Running setup.py (path:/tmp/pip-ecai8Q-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozprofile 14:00:40 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)) 14:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozrunner 14:00:40 INFO - Running setup.py (path:/tmp/pip-UQkLKK-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozrunner 14:00:40 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)) 14:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 14:00:40 INFO - Running setup.py (path:/tmp/pip-06BbXq-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozscreenshot 14:00:40 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)) 14:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/moztest 14:00:40 INFO - Running setup.py (path:/tmp/pip-iEhZfA-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/moztest 14:00:40 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)) 14:00:40 INFO - Unpacking /builds/slave/test-pgo/build/tests/mozbase/mozversion 14:00:40 INFO - Running setup.py (path:/tmp/pip-aFKi56-build/setup.py) egg_info for package from file:///builds/slave/test-pgo/build/tests/mozbase/mozversion 14:00:40 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)) 14:00:40 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)) 14:00:40 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)) 14:00:40 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)) 14:00:40 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)) 14:00:40 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)) 14:00:40 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test-pgo/build/tests/config/mozbase_requirements.txt (line 10)) 14:00:40 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 14:00:40 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 14:00:40 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 14:00:40 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 14:00:40 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 14:00:40 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 14:00:42 INFO - Downloading blessings-1.6.tar.gz 14:00:42 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/blessings/setup.py) egg_info for package blessings 14:00:42 INFO - Installing collected packages: blessings 14:00:42 INFO - Running setup.py install for blessings 14:00:42 INFO - Successfully installed blessings 14:00:42 INFO - Cleaning up... 14:00:42 INFO - Return code: 0 14:00:42 INFO - Done creating virtualenv /builds/slave/test-pgo/build/venv. 14:00:42 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 14:00:42 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 14:00:42 INFO - Reading from file tmpfile_stdout 14:00:42 INFO - Current package versions: 14:00:42 INFO - argparse == 1.2.1 14:00:42 INFO - blessings == 1.6 14:00:42 INFO - blobuploader == 1.2.4 14:00:42 INFO - docopt == 0.6.1 14:00:42 INFO - manifestparser == 1.1 14:00:42 INFO - mozInstall == 1.12 14:00:42 INFO - mozcrash == 0.16 14:00:42 INFO - mozdebug == 0.1 14:00:42 INFO - mozdevice == 0.48 14:00:42 INFO - mozfile == 1.2 14:00:42 INFO - mozhttpd == 0.7 14:00:42 INFO - mozinfo == 0.9 14:00:42 INFO - mozleak == 0.1 14:00:42 INFO - mozlog == 3.1 14:00:42 INFO - moznetwork == 0.27 14:00:42 INFO - mozprocess == 0.22 14:00:42 INFO - mozprofile == 0.28 14:00:42 INFO - mozrunner == 6.11 14:00:42 INFO - mozscreenshot == 0.1 14:00:42 INFO - mozsystemmonitor == 0.0 14:00:42 INFO - moztest == 0.7 14:00:42 INFO - mozversion == 1.4 14:00:42 INFO - psutil == 3.1.1 14:00:42 INFO - requests == 1.2.3 14:00:42 INFO - wsgiref == 0.1.2 14:00:42 INFO - Installing None into virtualenv /builds/slave/test-pgo/build/venv 14:00: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')]} 14:00:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:00:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00: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')]} 14:00:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:00:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:42 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 0x7fcdf4aabf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1669560>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, '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': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', '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 14:00:42 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 14:00:42 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 14:00:42 INFO - Using env: {'DISPLAY': ':0', 14:00:42 INFO - 'HOME': '/home/cltbld', 14:00:42 INFO - 'LANG': 'en_US.UTF-8', 14:00:42 INFO - 'LANGUAGE': 'en_US:en', 14:00:42 INFO - 'LOGNAME': 'cltbld', 14:00:42 INFO - 'MAIL': '/var/mail/cltbld', 14:00:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:00:42 INFO - 'MOZ_NO_REMOTE': '1', 14:00:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:00:42 INFO - 'NO_EM_RESTART': '1', 14:00:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:00:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:00:42 INFO - 'PWD': '/builds/slave/test-pgo', 14:00:42 INFO - 'SHELL': '/bin/bash', 14:00:42 INFO - 'SHLVL': '1', 14:00:42 INFO - 'TERM': 'linux', 14:00:42 INFO - 'TMOUT': '86400', 14:00:42 INFO - 'USER': 'cltbld', 14:00:42 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:00:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:00:42 INFO - '_': '/tools/buildbot/bin/python'} 14:00:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:00:42 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)) 14:00:42 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)) 14:00:42 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)) 14:00:42 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)) 14:00:42 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)) 14:00:42 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)) 14:00:42 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)) 14:00:42 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)) 14:00:42 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)) 14:00:42 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)) 14:00:42 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)) 14:00:42 INFO - Cleaning up... 14:00:42 INFO - Return code: 0 14:00:42 INFO - Installing jsonschema into virtualenv /builds/slave/test-pgo/build/venv 14:00: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')]} 14:00:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:00:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00: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')]} 14:00:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:00:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:42 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 0x7fcdf4aabf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1669560>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, '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': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', '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 14:00:42 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 14:00:42 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 14:00:42 INFO - Using env: {'DISPLAY': ':0', 14:00:42 INFO - 'HOME': '/home/cltbld', 14:00:42 INFO - 'LANG': 'en_US.UTF-8', 14:00:42 INFO - 'LANGUAGE': 'en_US:en', 14:00:42 INFO - 'LOGNAME': 'cltbld', 14:00:42 INFO - 'MAIL': '/var/mail/cltbld', 14:00:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:00:42 INFO - 'MOZ_NO_REMOTE': '1', 14:00:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:00:42 INFO - 'NO_EM_RESTART': '1', 14:00:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:00:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:00:42 INFO - 'PWD': '/builds/slave/test-pgo', 14:00:42 INFO - 'SHELL': '/bin/bash', 14:00:42 INFO - 'SHLVL': '1', 14:00:42 INFO - 'TERM': 'linux', 14:00:42 INFO - 'TMOUT': '86400', 14:00:42 INFO - 'USER': 'cltbld', 14:00:42 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:00:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:00:42 INFO - '_': '/tools/buildbot/bin/python'} 14:00:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:00:43 INFO - Downloading/unpacking jsonschema 14:00:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:00:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:00:43 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:00:43 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:00:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:00:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:00:44 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 14:00:44 INFO - Downloading/unpacking functools32 (from jsonschema) 14:00:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:00:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:00:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:00:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 14:00:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 14:00:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 14:00:45 INFO - Downloading functools32-3.2.3-2.tar.gz 14:00:45 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/functools32/setup.py) egg_info for package functools32 14:00:45 INFO - warning: no files found matching '*.txt' 14:00:45 INFO - no previously-included directories found matching 'build' 14:00:45 INFO - no previously-included directories found matching 'dist' 14:00:45 INFO - no previously-included directories found matching '.git*' 14:00:45 INFO - Installing collected packages: jsonschema, functools32 14:00:45 INFO - Running setup.py install for functools32 14:00:45 INFO - warning: no files found matching '*.txt' 14:00:45 INFO - no previously-included directories found matching 'build' 14:00:45 INFO - no previously-included directories found matching 'dist' 14:00:45 INFO - no previously-included directories found matching '.git*' 14:00:45 INFO - Successfully installed jsonschema functools32 14:00:45 INFO - Cleaning up... 14:00:45 INFO - Return code: 0 14:00:45 INFO - Installing flake8 into virtualenv /builds/slave/test-pgo/build/venv 14:00:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 14:00:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 14:00:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 14:00:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 14:00:45 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 0x7fcdf4aabf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x159c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1669560>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, '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': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', '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 14:00:45 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 14:00:45 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 14:00:45 INFO - Using env: {'DISPLAY': ':0', 14:00:45 INFO - 'HOME': '/home/cltbld', 14:00:45 INFO - 'LANG': 'en_US.UTF-8', 14:00:45 INFO - 'LANGUAGE': 'en_US:en', 14:00:45 INFO - 'LOGNAME': 'cltbld', 14:00:45 INFO - 'MAIL': '/var/mail/cltbld', 14:00:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:00:45 INFO - 'MOZ_NO_REMOTE': '1', 14:00:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:00:45 INFO - 'NO_EM_RESTART': '1', 14:00:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:00:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:00:45 INFO - 'PWD': '/builds/slave/test-pgo', 14:00:45 INFO - 'SHELL': '/bin/bash', 14:00:45 INFO - 'SHLVL': '1', 14:00:45 INFO - 'TERM': 'linux', 14:00:45 INFO - 'TMOUT': '86400', 14:00:45 INFO - 'USER': 'cltbld', 14:00:45 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:00:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:00:45 INFO - '_': '/tools/buildbot/bin/python'} 14:00:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 14:00:45 INFO - Downloading/unpacking flake8 14:00:45 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 14:00:45 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 14:00:45 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 14:00:45 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 14:00:45 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 14:00:45 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 14:00:47 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 14:00:47 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 14:00:47 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 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 14:00:47 INFO - Running setup.py (path:/builds/slave/test-pgo/build/venv/build/pep8/setup.py) egg_info for package pep8 14:00:48 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 14:00:48 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 14:00:48 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 14:00:48 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 14:00:48 INFO - no previously-included directories found matching 'docs/_build' 14:00:48 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 14:00:48 INFO - Running setup.py install for pep8 14:00:48 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 14:00:48 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 14:00:48 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 14:00:48 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 14:00:48 INFO - no previously-included directories found matching 'docs/_build' 14:00:48 INFO - Installing pep8 script to /builds/slave/test-pgo/build/venv/bin 14:00:48 INFO - Successfully installed flake8 mccabe pyflakes pep8 14:00:48 INFO - Cleaning up... 14:00:48 INFO - Return code: 0 14:00:48 INFO - Running post-action listener: _resource_record_post_action 14:00:48 INFO - Running post-action listener: _start_resource_monitoring 14:00:48 INFO - Starting resource monitoring. 14:00:48 INFO - ##### 14:00:48 INFO - ##### Running install step. 14:00:48 INFO - ##### 14:00:48 INFO - Running pre-action listener: _resource_record_pre_action 14:00:48 INFO - Running main action method: install 14:00:48 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/pip', 'freeze'] 14:00:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/pip freeze 14:00:48 INFO - Reading from file tmpfile_stdout 14:00:48 INFO - Detecting whether we're running mozinstall >=1.0... 14:00:48 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '-h'] 14:00:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall -h 14:00:48 INFO - Reading from file tmpfile_stdout 14:00:48 INFO - Output received: 14:00:48 INFO - Usage: mozinstall [options] installer 14:00:48 INFO - Options: 14:00:48 INFO - -h, --help show this help message and exit 14:00:48 INFO - -d DEST, --destination=DEST 14:00:48 INFO - Directory to install application into. [default: 14:00:48 INFO - "/builds/slave/test-pgo"] 14:00:48 INFO - --app=APP Application being installed. [default: firefox] 14:00:48 INFO - mkdir: /builds/slave/test-pgo/build/application 14:00:48 INFO - Getting output from command: ['/builds/slave/test-pgo/build/venv/bin/mozinstall', '/builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test-pgo/build/application'] 14:00:48 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/mozinstall /builds/slave/test-pgo/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test-pgo/build/application 14:01:04 INFO - Reading from file tmpfile_stdout 14:01:04 INFO - Output received: 14:01:04 INFO - /builds/slave/test-pgo/build/application/firefox/firefox 14:01:04 INFO - Running post-action listener: _resource_record_post_action 14:01:04 INFO - ##### 14:01:04 INFO - ##### Running run-tests step. 14:01:04 INFO - ##### 14:01:04 INFO - Running pre-action listener: _resource_record_pre_action 14:01:04 INFO - Running main action method: run_tests 14:01:04 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '--version'] 14:01:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python --version 14:01:04 INFO - Python 2.7.3 14:01:04 INFO - Return code: 0 14:01:04 INFO - grabbing minidump binary from tooltool 14:01: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')]} 14:01:04 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 0x16f8740>, '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 0x16f9640>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16f9af0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test-pgo/build', 'privileged': False}, attempt #1 14:01:04 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 14:01:04 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 14:01:04 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 14:01:04 INFO - Return code: 0 14:01:04 INFO - Chmoding /builds/slave/test-pgo/build/linux64-minidump_stackwalk to 0755 14:01:04 INFO - mkdir: /builds/slave/test-pgo/build/blobber_upload_dir 14:01:04 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test-pgo/build/blobber_upload_dir 14:01:04 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test-pgo/build/linux64-minidump_stackwalk 14:01:04 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test-pgo/build/blobber_upload_dir 14:01:04 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/flake8', '/builds/slave/test-pgo/build/tests/talos/talos'] 14:01:04 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/flake8 /builds/slave/test-pgo/build/tests/talos/talos 14:01:05 INFO - Return code: 0 14:01:05 INFO - Running command: ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'B2G-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-050', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test-pgo/build 14:01:05 INFO - Copy/paste: /builds/slave/test-pgo/build/venv/bin/python /builds/slave/test-pgo/build/tests/talos/talos/run_tests.py --branchName B2G-Inbound --suite dromaeojs --executablePath /builds/slave/test-pgo/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-050 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log 14:01:05 INFO - Using env: {'DISPLAY': ':0', 14:01:05 INFO - 'HOME': '/home/cltbld', 14:01:05 INFO - 'LANG': 'en_US.UTF-8', 14:01:05 INFO - 'LANGUAGE': 'en_US:en', 14:01:05 INFO - 'LOGNAME': 'cltbld', 14:01:05 INFO - 'MAIL': '/var/mail/cltbld', 14:01:05 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test-pgo/build/blobber_upload_dir', 14:01:05 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test-pgo/build/linux64-minidump_stackwalk', 14:01:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 14:01:05 INFO - 'MOZ_NO_REMOTE': '1', 14:01:05 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test-pgo/build/blobber_upload_dir', 14:01:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 14:01:05 INFO - 'NO_EM_RESTART': '1', 14:01:05 INFO - 'PATH': '/builds/slave/test-pgo/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 14:01:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test-pgo/buildprops.json', 14:01:05 INFO - 'PWD': '/builds/slave/test-pgo', 14:01:05 INFO - 'PYTHONPATH': '/builds/slave/test-pgo/build/tests/talos', 14:01:05 INFO - 'SHELL': '/bin/bash', 14:01:05 INFO - 'SHLVL': '1', 14:01:05 INFO - 'TERM': 'linux', 14:01:05 INFO - 'TMOUT': '86400', 14:01:05 INFO - 'USER': 'cltbld', 14:01:05 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109', 14:01:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 14:01:05 INFO - '_': '/tools/buildbot/bin/python'} 14:01:05 INFO - Calling ['/builds/slave/test-pgo/build/venv/bin/python', '/builds/slave/test-pgo/build/tests/talos/talos/run_tests.py', '--branchName', 'B2G-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test-pgo/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-050', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 14:01:06 INFO - mozversion application_buildid: 20160125113022 14:01:06 INFO - mozversion application_changeset: 247400b48effc0da40642209e34ae4dae37b93ad 14:01:06 INFO - mozversion application_display_name: Nightly 14:01:06 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 14:01:06 INFO - mozversion application_name: Firefox 14:01:06 INFO - mozversion application_remotingname: firefox 14:01:06 INFO - mozversion application_repository: https://hg.mozilla.org/integration/b2g-inbound 14:01:06 INFO - mozversion application_vendor: Mozilla 14:01:06 INFO - mozversion application_version: 46.0a1 14:01:06 INFO - mozversion platform_buildid: 20160125113022 14:01:06 INFO - mozversion platform_changeset: 247400b48effc0da40642209e34ae4dae37b93ad 14:01:06 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/b2g-inbound 14:01:06 INFO - mozversion platform_version: 46.0a1 14:01:06 INFO - using testdate: 1453759266 14:01:06 INFO - actual date: 1453759266 14:01:06 INFO - starting webserver on 'localhost:54450' 14:01:06 INFO - SUITE-START | Running 3 tests 14:01:06 INFO - TEST-START | dromaeo_css 14:01:06 INFO - operating with platform_type : linux_ 14:01:06 INFO - Initialising browser for dromaeo_css test... 14:01:06 INFO - TEST-INFO | started process 18640 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpPos6Bd/profile http://localhost:54450/getInfo.html) 14:01:09 INFO - PROCESS | 18640 | __metrics Screen width/height:1600/1200 14:01:09 INFO - PROCESS | 18640 | colorDepth:24 14:01:09 INFO - PROCESS | 18640 | Browser inner width/height: 1024/697 14:01:09 INFO - PROCESS | 18640 | __metrics 14:01:09 INFO - PROCESS | 18640 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 14:01:09 INFO - PROCESS | 18640 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 14:01:10 INFO - TEST-INFO | 18640: exit 0 14:01:10 INFO - Browser initialized. 14:01:10 INFO - Running cycle 1/1 for dromaeo_css test... 14:01:10 INFO - TEST-INFO | started process 18736 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpPos6Bd/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:01:22 INFO - PROCESS | 18736 | RSS: Main: 148688896 14:01:22 INFO - PROCESS | 18736 | 14:02:14 INFO - PROCESS | 18736 | 1453759334123 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] 14:04:22 INFO - PROCESS | 18736 | Cycle 1(1): loaded http://localhost:54450/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54450/tests/dromaeo/cssquery-ext.html) 14:04:23 INFO - PROCESS | 18736 | RSS: Main: 273408000 14:04:23 INFO - PROCESS | 18736 | 14:07:25 INFO - PROCESS | 18736 | Cycle 1(1): loaded http://localhost:54450/tests/dromaeo/cssquery-ext.html (next: http://localhost:54450/tests/dromaeo/cssquery-jquery.html) 14:07:26 INFO - PROCESS | 18736 | RSS: Main: 228773888 14:07:26 INFO - PROCESS | 18736 | 14:10:28 INFO - PROCESS | 18736 | Cycle 1(1): loaded http://localhost:54450/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54450/tests/dromaeo/cssquery-mootools.html) 14:10:28 INFO - PROCESS | 18736 | RSS: Main: 241549312 14:10:28 INFO - PROCESS | 18736 | 14:13:30 INFO - PROCESS | 18736 | Cycle 1(1): loaded http://localhost:54450/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54450/tests/dromaeo/cssquery-prototype.html) 14:13:31 INFO - PROCESS | 18736 | RSS: Main: 212504576 14:13:31 INFO - PROCESS | 18736 | 14:16:33 INFO - PROCESS | 18736 | Cycle 1(1): loaded http://localhost:54450/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54450/tests/dromaeo/cssquery-yui.html) 14:16:34 INFO - PROCESS | 18736 | RSS: Main: 219934720 14:16:34 INFO - PROCESS | 18736 | 14:19:37 INFO - PROCESS | 18736 | Cycle 1(1): loaded http://localhost:54450/tests/dromaeo/cssquery-yui.html (next: http://localhost:54450/tests/dromaeo/cssquery-dojo.html) 14:19:37 INFO - PROCESS | 18736 | RSS: Main: 259121152 14:19:37 INFO - PROCESS | 18736 | 14:19:37 INFO - PROCESS | 18736 | __start_tp_report 14:19:37 INFO - PROCESS | 18736 | _x_x_mozilla_page_load 14:19:37 INFO - PROCESS | 18736 | _x_x_mozilla_page_load_details 14:19:37 INFO - PROCESS | 18736 | |i|pagename|runs| 14:19:37 INFO - PROCESS | 18736 | |0;dojo.html;3099.7055279748424;3114.7508199344056;3158.5735925650047;3161.4783560712485;3191.585093937788;4984.277279794428;5040.294358789773;5057.721825299607;5065.012322597095;5079.161938280188;5096.108181068316;5098.031374038939;5101.617378696594;5110.846674599758;5144.408393034792;4640.907181856361;4661.976690116553;4721.740304283263;4766.6901651392545;4783.402074740658;4727.149113159629;4739.218029025206;4757.881052973668;4811.08589368019;4821.879453013686;4604.148232576984;4613.677042607019;4656.4645065817185;4662.626989840838;4670.556297151782;4625.676202665814;4647;4669.463011753658;4670.392848929651;4684.508126646721;4616.915024969129;4628.699134556243;4634.443866735979;4666.2767271073035;4702.882427939329;4894.681845680019;4899.902001959941;4956.10790057793;4963.70217786934;4972.328735620681;5376.865578360533;5378.327709036371;5379.112446446371;5379.67721936685;5426.968875913563;5404.270423492818;5404.756785944642;5438.374586922515;5463;5481.725913704299;5101.642884998052;5119.948800511947;5123.795048198068;5124.846254612367;5138.7687554059785;5519.668819870821;5522.585806064561;5524.033294173503;5526;5551;5228.398734145546;5307.946920530745;5328.067588172132;5336.813211537577;5339.759710813023;5367.78528858849;5418.051840927822;5422.132458806572;5440.91838622421;5463.48096930791;5438.619296649275;5461.563074953994;5462.918056229159;5474.124140137638;5510.090835012258;5307.3896501902;5391.05656510117;5445.891082178334;5452.427495113036;5471.699056551848;4279.679024073207;4303.332983387518;4306.0311429928015;4315.395844581761;4321.5678432157165;3789.3558095123894;3829.483019792348;3842.4044273137706;3867.1298957734284;3894.162755007687;5072.442031376546;5072.746362681925;5096.464871188472;5102.642815002989;5137.409197942285;5475.260839786578;5491.368492623399;5493.533049690821;5500.477454641803;5517.751701173457;5069.9746501267255;5074.619403544749;5084.542391184811;5089.211172268304;5117.334746483008;4608.101420223024;4667.369905062773;4684.8360307389075;4707.082118986765;4751.667383283206;5644.971775141098;5655.4344565543115;5667.688277144796;5678.545716342683;5685.971570142206;5479.123340265538;5502.367227768857;5503.862403439946;5512.448755124456;5556.083246264321;5533.6126471148245;5536.916946245729;5573.108302671553;5633.88732225345;5673.489385955284;5400.648957817729;5444.863878403072;5459.508644222039;5471.37079235893;5473.753681084281;5436.700981446058;5488.204210389551;5496.31296087989;5504.779808807602;5516.365617953987;5319.707416092152;5375.81184658535;5376.220448034935;5401.351837779492;5427.918581221206;5297.258383826191;5352.785888564569;5380.219868119023;5404.243405923095;5428.348598168245;5145.099607568735;5166.819161329336;5172.663776854492;5177.326947496801;5213.973930130325;5268.710220937885;5299.655522391032;5301.939612077523;5303.867403314948;5306.442823503631;5148.871278218075;5267.183586544092;5303.071962406486;5305.946940530545;5326.920096198638 14:19:37 INFO - PROCESS | 18736 | |1;ext.html;515.5514702209078;518.6162239942441;521.3066621393547;545.2339463054406;552.8756029893274;27847.30381740455;28406.85796571017;35355.64644353556;35820.46269305963;35933.82033089831;37629.81185094077;38145.42781858268;38213.426798597975;38306;38338;8364.498130112197;8559.700410485635;8560.400771945966;8563.314934805201;8563.700270490534;8234.3412526998;8394.160583941619;8395.076541580422;8399;8399.034111077213;8595.871061934076;8683.435576687527;8684.696035638754;8686.522241276727;8688.131186881325;8524.78688032798;8590.969083709932;8608.956955215184;8612.18184272493;8616.784580385478;8433;8554.743357699217;8574.571271436465;8575.614097365633;8579.52812595307;38356.80821595874;38923;39064.414033789515;39093.21813563741;39098.21803563941;3092.963857107849;3124.7343975762087;3298.5876765404323;3496.6328535503662;3527.6119626841282;29313.267168320748;30022;30222.395552089056;30398.84800576005;30412.896236775392;3630.709543236535;3721.291401606793;3888.844446222148;3939.231849789292;3983.581723918976;270089;270919;271724;271809;273255;50784.238236426485;50978.490215098114;55397.72301138468;55831.72084139553;55865.44134558603;61056.38943610596;62159.37840621627;62290.68854655698;62443.375566243754;62460.687696561225;12440.75118497643;12658.936705316599;12664;12667.619971400873;12679.873201267868;8638.438501497383;8874.334424918157;8878.778030549158;8879.644814207488;9071.455712657262;19408.360448076415;19967;19987.20051197965;20059.197632094554;20087.698684519743;7603.391728661693;7713.8457230855065;7927.960360198277;8017.719379821679;8040.316573091352;952.5094576293214;1008.863803386548;1032.339302846179;1053.562771449855;1115.7824224276187;27969.160925172277;28026.71973280282;28142.15573532797;28547.429051418854;28627.14118576446;1002.2983911262146;1030.953607087668;1047.1099565369375;1069.1607088435542;1098.5605757696985;14667.559973200821;14757.704845903236;14848.851511484747;15003.17482538449;15027.323770430357;318676;327336;327786;327926;327967;51641.741791291555;52026;52034.739826300625;52076.739616301675;52169;1320.7358528294187;1324.6158614001831;1349.069142291835;1349.6490912362856;1354.4582167133226;27237.455250894476;28263.15210543687;28263.994945751365;28364.432711345245;28553.28616784597;45385.319220211066;45413.31880021869;45678.77160614176;45856.31215531703;45907;302328;304271;305194;306645;307467;26927.461450771265;27459.588106178024;31409.685903140675;31445.213869653442;31578.842105789325;36833;37665.62334376621;37726.81136594409;38164.61835381722;38199.2360152801;31074.223144420666;31868.8406557975;32331.35337293194;32630.347393051532;32888.34223315568;26392;27785.583216252176;27871.44257114887;34925.82537087298;38671;33854.3229135411;34418.48372274468;34558.308833823685;34992.65007349894;35103.47344789779;27610;29055.854720727108;29681.406371872872;30869.831348564083;32014.35971280608;23121.421964451023;23247.41881452977;23324.53350932938;24476.75523244745;24688.658523253063 14:19:37 INFO - PROCESS | 18736 | |2;jquery.html;358.2137208826626;358.9533360663115;359.06284597201306;359.91182160370715;360.320795300858;13639.863601363983;14135.363908624111;15705.921470392646;16223.75664365034;17160.05619690915;14572;15183.16492592907;15622.609434764137;15737.921310393433;15893.52319430416;5261.158214685661;5517.586181036419;5544.3346798384255;5546.334439867222;5549.417311182328;4042.3532234842432;4166;5402.756875940572;5516;5816.33112192097;5888.97055514724;5962.25471816023;5988.610740301889;6001.279846418436;6002.159697642333;4904.779284932169;5025.623078269126;5045.192769156917;5078.31442755227;5084.186530155157;4819.903601927942;4851.393575803025;5018.924716129261;5019.121653710586;5021.497850214986;11469;11484.368359740294;17200.569985750455;20062.699059514118;20066.598668026705;1994.4415563642203;2003.2387692676834;2013.134352228541;2020.121247257433;2066.2561477867957;6108.602940808878;7411.0736157980255;9034.277257819358;9257.074292570689;9400.059994000614;1854.8979806110658;1860.8790428622096;1874.2690350763214;1876.3901731937176;1884.9434516964513;54698.90602187974;55415.168772468445;56512;56616.716916415564;57207;9197.770055748526;9422.152006319464;9485.478298693639;9487.715368538955;9613;13038.608841734764;13084.214947103204;13090;13104.344782760823;13108.147970382086;6230.937690623126;6579.736810527525;6613.338666133444;6632.734690612321;6685.966570167216;6241.063840423973;6274.278457977391;6289.308176100625;6295.18162638854;6303.936960630427;3888.6889048876587;3912.941305880414;4027.7583344999393;4039;4049.8380064797666;1646.4233474612195;1705.8891172073775;1749.2915369275463;1788.043396782715;1818.809025052377;897.7351681254046;917.866909298148;924.4915296586851;929.3355250995571;987.4124895687055;14612.050216735877;15512.379504819906;15845.52463426099;16410.17949102564;16720.665586688443;870.6734974384606;901.4906577783531;906.3202598051462;920.7882187097006;933.0715937641954;7405;9151.862722059175;9203.723888283363;9340.813183736287;9424.575894084646;362406;488958;548783;591702;593271;46066.30900536494;55560.16659750107;68081.3191868075;71279.2872071283;72378;1090.650991682654;1113.5768408004906;1114.4427786106946;1115.570505355444;1134.5802053240188;15027.474038408604;15056.698866022838;15165.393384264948;15226.77159842581;15495.922520387327;32826.50760238646;33381.66618333785;33470;33680;33847.49228761521;43432.34851477167;43733.34399983939;43824.780876095414;44159;46783.29825052695;6600.636964966973;6665.50008749336;6781.796546103427;6880.174379074543;7165.211826698955;7753.534787912743;8225.83548329018;10338.328008679411;11014.339139651647;11046.889531104585;9053;9125.589348479201;9461.95269023678;9611.855822162814;9690.273229507675;9711.973577205272;9766.75583110428;9836.754081147743;10359.22305827081;10380.169586433218;7017.175639276505;9083.68207112748;9138.17756401927;9893.505324733878;10113.747156321151;7081.539699919489;7084.574925504487;7100.857982840417;7128.928710712827;7198.136223653195;7596.658150383357;9811.067948544876;9825.312228143961;9912.801743964936;10256.179505639382 14:19:37 INFO - PROCESS | 18736 | |3;mootools.html;1327.3960348041642;1463.7584798508246;1481.03732573827;1643.9178041097941;1801.6306657135297;7134.357907788298;7746.92253077469;7887;7887.566183859885;7900.32847207988;7675.961620191905;7865.528068315891;7873;7880;7884.448088633798;2019.61627290815;2065.1326442893946;2260.638297872341;2320.3619004773655;2347.3896786835376;2285.268714011517;2305.6310990241564;2318.733345665253;2321.3616255529696;2323.570139524185;2228.43174990378;2301.5627030864084;2304.493011537459;2307.377008207783;2309.445733024079;2277.5103352779147;2289.461976435536;2330.07961855068;2335.859848409101;2340.566995105911;2277.055022165799;2277.8633282003134;2293.392251053472;2298.8965496552696;2321.025169428844;7321.487495875291;7388;7388.150362708304;7389.076365454318;7391.519551229153;4666.626669866402;4774.522547745232;4816.133096042711;4818.277258411232;4820.060088282787;2999.8302359720005;3019.531972544259;3062;3072.6159230096237;3092.8762849485993;938.7183844846587;953.9666111686058;971.8930917599058;974.8099120671401;995.7908839143788;10505.054545090901;10735.355878647306;10739.24825262232;10763.569457221702;10785.13718902486;4067.1662309226535;4099.754014759124;4159.147374788161;4175.185838761473;4181.686373521998;9158;9160.6793762218;9181.127792859668;9183.58673859678;9189.816203676022;4631.374764406829;4649.442066951988;4651.3720647712125;4654.557817007379;4664.207084795593;4211.7262377945335;4216.9578304217175;4221.176870510221;4221.409002739619;4227.048913994388;3461.238527523941;3489.4416893296952;3494.2138018946043;3496.2483066140394;3553.7867727936405;1159.8898104680043;1165.597868735285;1173.184636677501;1177.5584155941522;1182.722060315825;998.3710262534556;1021.1779517488493;1022.3303736052898;1130.361345839598;1329.1759109352263;7010.053642758265;7092.078029856086;7115.964420177866;7135.250798666066;7143.82140446493;1062.9309094908806;1074.5379486820586;1082.1883587309517;1098.1324753444849;1102.525913857049;5712.657240565496;5738.340090889517;5815.709214539256;5830.5044071254415;5905.320888097924;9400.858987115198;9759.756006099904;9769;9887.505624718735;9943.25425593069;9442.763930901783;9644.083812037845;9698.46658433793;9720.416774993522;9884.802303954024;7412.925870741331;7500.887486687704;7501.962490187623;7505;7508.962455187799;7280.563166210044;7337.523061001018;7382.630868456448;7386.482946193715;7401.111866576045;8623.396362254833;8675.956620216859;8716.477011379338;8734;8747;8866.290696744116;8888;8936.553172341228;9129.315301352291;9139.405938613969;7148.28517148281;7148.606826624377;7175;7220.133583969957;7226.241244669234;6167.259928808572;6302.968485157545;7565.205653406313;7614.200508946702;7719.6140192989005;6922.342377474132;6926.238113807578;6971.058907047686;7016.5088443808445;7253.310935461122;6824.351686589766;6930.48021398387;6982.720691172296;7069.363757261871;7123.145222573325;6987.301269872972;7017.929820701727;7039.19049309336;7041.014258003781;7043.6830342633675;6572.868542629216;6605.702743376656;6636.502262330441;6640.83397915056;6748.122744043243;6556.2788093308745;6600.108985287116;6603.80188594343;6608.537402381787;6610.8347291318105 14:19:37 INFO - PROCESS | 18736 | |4;prototype.html;314.9401613693398;322.6434789557539;326.07882731284116;328.3941128617702;334.56673607678067;5759.68321742304;5778.104393818954;5785;5802.419758024201;5810.854728631776;5543.445655434464;5556.972215138929;5666.065099258617;5694.829155125353;5724.34170070442;4436;4443.755593442367;4450.109978004396;4454.599086082252;4472.731636101828;4235.364695295715;4449.377087207794;4454.510003899569;4454.5545445455355;4461.795315264877;4279.7860106994685;4314.568543145691;4416.911661766762;4428.202923473774;4435.578620031092;4388.319810429389;4413.271810151337;4419.381286619876;4422.447194100738;4434.955650443519;3892.3188442022533;3905.297046531623;3908.042529580271;3916.6475017248586;3918.5101862267215;5449.373322067933;5461.317335333083;5463.426340234298;5468.890622187574;5478.123500239983;4874.829380971649;4985.102681517362;4992.975035124838;4999.075171093359;5032.968241510518;5977.940220597782;5983.940160598382;5984.910226346608;5986.401359864022;5987.820365389001;4216.810243539048;4219.641330486912;4222.1766755482695;4222.619964203236;4223.155368926227;6159.076138579204;6303.086052522359;6380.904286435707;6390.0734393512685;6396.200474940632;4344.087741574304;4349.151915376535;4350.216960946997;4350.238708226111;4351.97824010878;4357.54245804186;4392.099619577979;4394.604485596312;4401.977990110029;4407.0524837160165;5085.4914508548845;5088.542031217208;5096.949030509648;5100.413452452941;5107.387113546324;5989.8203053908455;6110.877782444326;6120.969395152996;6160.322364539897;6172.382761723792;1530.9234538273042;1538.692261547695;1543.8378970207966;1559.235974372572;1561.5783738390571;1023.7338292044122;1034.632705389591;1036.9429681367596;1055.0978913029248;1058.0424715632364;5826.388229235869;5867.031939729982;5872.2366092408565;5877;5880.147378630075;6316.463100636405;6321.494280457552;6322.683865806691;6323.20959880015;6325;5674.77300907959;5736.913946290809;5826.300843898674;5919.437653422918;5920.171176035358;3409.4715319125576;3417.641147679458;3426.588809342895;3429.4684323929832;3434.8797792077157;6613.272540020594;6618.172728408949;6619.238787539398;6620;6622.8013159604325;6363.713632886531;6525.575837570543;6545.541812073109;6545.607263564201;6619.139511863427;6637.269900310962;6639.900401493981;6645.435138013227;6646;6652.900206496906;6387.329330420424;6400.199975003125;6410.294867564658;6415.069814876723;6424.678766061772;6095.542834287535;6265;6312.4634406076;6333.778317758856;6345.7144428499905;6611.735530578723;6613.14029176204;6621.966890165519;6623;6625.834354141185;4294.463192100988;4313.633341165911;4319.265724826724;4328.870133895988;4331.501877284027;6284.622922624657;6407.711652975534;6409.8718025640155;6414.390632889868;6421.646809425526;6223.3465486125115;6226.097215903578;6226.844328891632;6235;6235.127082208585;6192.318844926965;6204.069389591597;6204.720787564661;6212.875742485216;6222;5922.1412895130825;6059.454649081604;6062.090686397076;6071.058985857199;6078.635281883101;6198.2252218472695;6240.594361366497;6241.3134555197985;6245.156903817927;6247.781327653511;6098.603590766586;6108.175396321618;6114.144019837137;6122.326544080059;6131.877362452637 14:19:37 INFO - PROCESS | 18736 | |5;yui.html;750.1860481377706;796.2077732656008;826.277007618334;832.5337810825937;853.4282031039207;13030.73938521229;13089.67275818104;13248.403821828017;13282.601521954333;13350;12641.49434022638;12720;12735.363231838417;12736.363181840918;12776.16954897931;642.604798049201;650.622638869457;780.8047988003;790.158481217503;801.5911884938694;780.0678189563474;781.2617076862367;785.9724909628164;788.6490511722286;788.73577351587;825.3026192867047;827.5159031966307;830.4726498673356;834.0283569641391;835.7534527314457;669.1267895396505;680.4930326906461;817.5748610722451;828.5194587139445;836.9916300836975;612.4304396910871;613.3284053960906;613.5061275673081;614.6772944204283;615.1695211464532;13384.732305353838;13692.589222323246;13704.45182192711;13706.93146534271;13710;11455.369954652491;12477.126601137925;12770.106092573524;13166.53917112906;13514.459421623222;9825.90174098257;9849.21206303494;9904.55429505674;10342.37945723259;10417.60395109129;3268.4116858965376;3320.49092425626;3328.5340052392685;3352.1787162145188;3391.8982430527126;43596.78201609004;43641.56358436407;43877.99999999968;44246.11507769859;44272.77863610661;9154.542272886329;9262.629494820267;9321.906780932239;9411.576479058458;9558.091981261769;17052.2326495308;17067.48797536076;17069.146542672817;17079.146042697816;17091.401800937158;7501.821913529805;7521.473496855277;7528.209537998541;7674.961625191839;7750.573718445539;4181.289180839264;4225.704200705983;4261.74429534229;4429.579189976947;4589.311603259471;2910.2287893708185;2951.3507028453705;2964.6294213223346;2977.2705687106363;2982.41842840644;560.7252446301364;564.0383146734807;567.044529967007;579.1428685545417;580.1993249315917;557.5623135838348;585.6017907822636;603.5925750118653;622.2129006806393;636.522608043967;7869.370450364072;7931.56376399292;8123.106458289583;8194.631241594143;8362.79093022667;615.3047056825848;624.0576729139033;625.968701564929;629.150646627059;661.9871596457427;3676.1361080146144;3853.2678791029616;3902.726809123391;4015.9799201003807;4040.959590404117;59820;60439;60603;60755;60898.695506522185;51270.230946535834;52342.738286308326;52445.47554524482;52454.213186802226;52511.212331815055;45683.77158114188;46450.76774616173;46906.82732931636;47286.52713472821;47295.763521182176;7885.5662938538935;8279;8300.543470109202;8343.707970221014;8381.245687888118;34969.950901473;35169.47245791264;35300.29399412049;35474.11314717153;36075.458868116475;45913;46803;47005.764971174925;47061.76469117632;47062.294065589726;9797.55910983993;9868.358556693793;9987.950060249652;10241.539130739284;10366.326188797704;10646.627368042082;10773.946130269298;11390.430478475877;11509.597164099216;11788.646340609796;9967.10296073357;10497.47512624381;10517.94820517942;10554.788904222027;10796.838047429137;9515.429074255568;9712.3201375903;9757.902420975699;10032.347897386646;10152;9605.279604029585;9947.05502977216;10636.84044739314;10671.733206669895;10857;8550.187732165434;8594.570271486276;8624.568771561522;8742.256908162622;8876.378653494194;8372.958135209285;8562.357823163164;8686.218240358397;8837.602307896032;8838.955805220932 14:19:37 INFO - PROCESS | 18736 | __end_tp_report 14:19:37 INFO - PROCESS | 18736 | __start_cc_report 14:19:37 INFO - PROCESS | 18736 | _x_x_mozilla_cycle_collect,969 14:19:37 INFO - PROCESS | 18736 | __end_cc_report 14:19:37 INFO - PROCESS | 18736 | __startTimestamp1453760377581__endTimestamp 14:19:37 INFO - PROCESS | 18736 | 14:19:37 INFO - PROCESS | 18736 | ------- Summary: start ------- 14:19:37 INFO - PROCESS | 18736 | Number of tests: 6 14:19:37 INFO - PROCESS | 18736 | 14:19:37 INFO - PROCESS | 18736 | [#0] dojo.html Cycles:165 Average:5075.13 Median:5267.18 stddev:531.39 (10.1%) stddev-sans-first:509.92 14:19:37 INFO - PROCESS | 18736 | Values: 3099.7 3114.8 3158.6 3161.5 3191.6 4984.3 5040.3 5057.7 5065.0 5079.2 5096.1 5098.0 5101.6 5110.8 5144.4 4640.9 4662.0 4721.7 4766.7 4783.4 4727.1 4739.2 4757.9 4811.1 4821.9 4604.1 4613.7 4656.5 4662.6 4670.6 4625.7 4647.0 4669.5 4670.4 4684.5 4616.9 4628.7 4634.4 4666.3 4702.9 4894.7 4899.9 4956.1 4963.7 4972.3 5376.9 5378.3 5379.1 5379.7 5427.0 5404.3 5404.8 5438.4 5463.0 5481.7 5101.6 5119.9 5123.8 5124.8 5138.8 5519.7 5522.6 5524.0 5526.0 5551.0 5228.4 5307.9 5328.1 5336.8 5339.8 5367.8 5418.1 5422.1 5440.9 5463.5 5438.6 5461.6 5462.9 5474.1 5510.1 5307.4 5391.1 5445.9 5452.4 5471.7 4279.7 4303.3 4306.0 4315.4 4321.6 3789.4 3829.5 3842.4 3867.1 3894.2 5072.4 5072.7 5096.5 5102.6 5137.4 5475.3 5491.4 5493.5 5500.5 5517.8 5070.0 5074.6 5084.5 5089.2 5117.3 4608.1 4667.4 4684.8 4707.1 4751.7 5645.0 5655.4 5667.7 5678.5 5686.0 5479.1 5502.4 5503.9 5512.4 5556.1 5533.6 5536.9 5573.1 5633.9 5673.5 5400.6 5444.9 5459.5 5471.4 5473.8 5436.7 5488.2 5496.3 5504.8 5516.4 5319.7 5375.8 5376.2 5401.4 5427.9 5297.3 5352.8 5380.2 5404.2 5428.3 5145.1 5166.8 5172.7 5177.3 5214.0 5268.7 5299.7 5301.9 5303.9 5306.4 5148.9 5267.2 5303.1 5305.9 5326.9 14:19:37 INFO - PROCESS | 18736 | 14:19:37 INFO - PROCESS | 18736 | [#1] ext.html Cycles:180 Average:45811.63 Median:19211.23 stddev:79095.51 (411.7%) stddev-sans-first:79244.28 14:19:37 INFO - PROCESS | 18736 | Values: 515.6 518.6 521.3 545.2 552.9 27847.3 28406.9 35355.6 35820.5 35933.8 37629.8 38145.4 38213.4 38306.0 38338.0 8364.5 8559.7 8560.4 8563.3 8563.7 8234.3 8394.2 8395.1 8399.0 8399.0 8595.9 8683.4 8684.7 8686.5 8688.1 8524.8 8591.0 8609.0 8612.2 8616.8 8433.0 8554.7 8574.6 8575.6 8579.5 38356.8 38923.0 39064.4 39093.2 39098.2 3093.0 3124.7 3298.6 3496.6 3527.6 29313.3 30022.0 30222.4 30398.8 30412.9 3630.7 3721.3 3888.8 3939.2 3983.6 270089.0 270919.0 271724.0 271809.0 273255.0 50784.2 50978.5 55397.7 55831.7 55865.4 61056.4 62159.4 62290.7 62443.4 62460.7 12440.8 12658.9 12664.0 12667.6 12679.9 8638.4 8874.3 8878.8 8879.6 9071.5 19408.4 19967.0 19987.2 20059.2 20087.7 7603.4 7713.8 7928.0 8017.7 8040.3 952.5 1008.9 1032.3 1053.6 1115.8 27969.2 28026.7 28142.2 28547.4 28627.1 1002.3 1031.0 1047.1 1069.2 1098.6 14667.6 14757.7 14848.9 15003.2 15027.3 318676.0 327336.0 327786.0 327926.0 327967.0 51641.7 52026.0 52034.7 52076.7 52169.0 1320.7 1324.6 1349.1 1349.6 1354.5 27237.5 28263.2 28264.0 28364.4 28553.3 45385.3 45413.3 45678.8 45856.3 45907.0 302328.0 304271.0 305194.0 306645.0 307467.0 26927.5 27459.6 31409.7 31445.2 31578.8 36833.0 37665.6 37726.8 38164.6 38199.2 31074.2 31868.8 32331.4 32630.3 32888.3 26392.0 27785.6 27871.4 34925.8 38671.0 33854.3 34418.5 34558.3 34992.7 35103.5 27610.0 29055.9 29681.4 30869.8 32014.4 23121.4 23247.4 23324.5 24476.8 24688.7 14:19:37 INFO - PROCESS | 18736 | 14:19:37 INFO - PROCESS | 18736 | [#2] jquery.html Cycles:180 Average:26245.75 Median:5081.25 stddev:85654.22 (1685.7%) stddev-sans-first:85872.44 14:19:37 INFO - PROCESS | 18736 | Values: 358.2 359.0 359.1 359.9 360.3 13639.9 14135.4 15705.9 16223.8 17160.1 14572.0 15183.2 15622.6 15737.9 15893.5 5261.2 5517.6 5544.3 5546.3 5549.4 4042.4 4166.0 5402.8 5516.0 5816.3 5889.0 5962.3 5988.6 6001.3 6002.2 4904.8 5025.6 5045.2 5078.3 5084.2 4819.9 4851.4 5018.9 5019.1 5021.5 11469.0 11484.4 17200.6 20062.7 20066.6 1994.4 2003.2 2013.1 2020.1 2066.3 6108.6 7411.1 9034.3 9257.1 9400.1 1854.9 1860.9 1874.3 1876.4 1884.9 54698.9 55415.2 56512.0 56616.7 57207.0 9197.8 9422.2 9485.5 9487.7 9613.0 13038.6 13084.2 13090.0 13104.3 13108.1 6230.9 6579.7 6613.3 6632.7 6686.0 6241.1 6274.3 6289.3 6295.2 6303.9 3888.7 3912.9 4027.8 4039.0 4049.8 1646.4 1705.9 1749.3 1788.0 1818.8 897.7 917.9 924.5 929.3 987.4 14612.1 15512.4 15845.5 16410.2 16720.7 870.7 901.5 906.3 920.8 933.1 7405.0 9151.9 9203.7 9340.8 9424.6 362406.0 488958.0 548783.0 591702.0 593271.0 46066.3 55560.2 68081.3 71279.3 72378.0 1090.7 1113.6 1114.4 1115.6 1134.6 15027.5 15056.7 15165.4 15226.8 15495.9 32826.5 33381.7 33470.0 33680.0 33847.5 43432.3 43733.3 43824.8 44159.0 46783.3 6600.6 6665.5 6781.8 6880.2 7165.2 7753.5 8225.8 10338.3 11014.3 11046.9 9053.0 9125.6 9462.0 9611.9 9690.3 9712.0 9766.8 9836.8 10359.2 10380.2 7017.2 9083.7 9138.2 9893.5 10113.7 7081.5 7084.6 7100.9 7128.9 7198.1 7596.7 9811.1 9825.3 9912.8 10256.2 14:19:37 INFO - PROCESS | 18736 | 14:19:37 INFO - PROCESS | 18736 | [#3] mootools.html Cycles:180 Average:5494.58 Median:6607.12 stddev:2886.13 (43.7%) stddev-sans-first:2877.23 14:19:37 INFO - PROCESS | 18736 | Values: 1327.4 1463.8 1481.0 1643.9 1801.6 7134.4 7746.9 7887.0 7887.6 7900.3 7676.0 7865.5 7873.0 7880.0 7884.4 2019.6 2065.1 2260.6 2320.4 2347.4 2285.3 2305.6 2318.7 2321.4 2323.6 2228.4 2301.6 2304.5 2307.4 2309.4 2277.5 2289.5 2330.1 2335.9 2340.6 2277.1 2277.9 2293.4 2298.9 2321.0 7321.5 7388.0 7388.2 7389.1 7391.5 4666.6 4774.5 4816.1 4818.3 4820.1 2999.8 3019.5 3062.0 3072.6 3092.9 938.7 954.0 971.9 974.8 995.8 10505.1 10735.4 10739.2 10763.6 10785.1 4067.2 4099.8 4159.1 4175.2 4181.7 9158.0 9160.7 9181.1 9183.6 9189.8 4631.4 4649.4 4651.4 4654.6 4664.2 4211.7 4217.0 4221.2 4221.4 4227.0 3461.2 3489.4 3494.2 3496.2 3553.8 1159.9 1165.6 1173.2 1177.6 1182.7 998.4 1021.2 1022.3 1130.4 1329.2 7010.1 7092.1 7116.0 7135.3 7143.8 1062.9 1074.5 1082.2 1098.1 1102.5 5712.7 5738.3 5815.7 5830.5 5905.3 9400.9 9759.8 9769.0 9887.5 9943.3 9442.8 9644.1 9698.5 9720.4 9884.8 7412.9 7500.9 7502.0 7505.0 7509.0 7280.6 7337.5 7382.6 7386.5 7401.1 8623.4 8676.0 8716.5 8734.0 8747.0 8866.3 8888.0 8936.6 9129.3 9139.4 7148.3 7148.6 7175.0 7220.1 7226.2 6167.3 6303.0 7565.2 7614.2 7719.6 6922.3 6926.2 6971.1 7016.5 7253.3 6824.4 6930.5 6982.7 7069.4 7123.1 6987.3 7017.9 7039.2 7041.0 7043.7 6572.9 6605.7 6636.5 6640.8 6748.1 6556.3 6600.1 6603.8 6608.5 6610.8 14:19:37 INFO - PROCESS | 18736 | 14:19:37 INFO - PROCESS | 18736 | [#4] prototype.html Cycles:180 Average:5134.83 Median:5806.64 stddev:1556.61 (26.8%) stddev-sans-first:1518.35 14:19:37 INFO - PROCESS | 18736 | Values: 314.9 322.6 326.1 328.4 334.6 5759.7 5778.1 5785.0 5802.4 5810.9 5543.4 5557.0 5666.1 5694.8 5724.3 4436.0 4443.8 4450.1 4454.6 4472.7 4235.4 4449.4 4454.5 4454.6 4461.8 4279.8 4314.6 4416.9 4428.2 4435.6 4388.3 4413.3 4419.4 4422.4 4435.0 3892.3 3905.3 3908.0 3916.6 3918.5 5449.4 5461.3 5463.4 5468.9 5478.1 4874.8 4985.1 4993.0 4999.1 5033.0 5977.9 5983.9 5984.9 5986.4 5987.8 4216.8 4219.6 4222.2 4222.6 4223.2 6159.1 6303.1 6380.9 6390.1 6396.2 4344.1 4349.2 4350.2 4350.2 4352.0 4357.5 4392.1 4394.6 4402.0 4407.1 5085.5 5088.5 5096.9 5100.4 5107.4 5989.8 6110.9 6121.0 6160.3 6172.4 1530.9 1538.7 1543.8 1559.2 1561.6 1023.7 1034.6 1036.9 1055.1 1058.0 5826.4 5867.0 5872.2 5877.0 5880.1 6316.5 6321.5 6322.7 6323.2 6325.0 5674.8 5736.9 5826.3 5919.4 5920.2 3409.5 3417.6 3426.6 3429.5 3434.9 6613.3 6618.2 6619.2 6620.0 6622.8 6363.7 6525.6 6545.5 6545.6 6619.1 6637.3 6639.9 6645.4 6646.0 6652.9 6387.3 6400.2 6410.3 6415.1 6424.7 6095.5 6265.0 6312.5 6333.8 6345.7 6611.7 6613.1 6622.0 6623.0 6625.8 4294.5 4313.6 4319.3 4328.9 4331.5 6284.6 6407.7 6409.9 6414.4 6421.6 6223.3 6226.1 6226.8 6235.0 6235.1 6192.3 6204.1 6204.7 6212.9 6222.0 5922.1 6059.5 6062.1 6071.1 6078.6 6198.2 6240.6 6241.3 6245.2 6247.8 6098.6 6108.2 6114.1 6122.3 6131.9 14:19:37 INFO - PROCESS | 18736 | 14:19:37 INFO - PROCESS | 18736 | [#5] yui.html Cycles:180 Average:13563.91 Median:565.54 stddev:16222.39 (2868.5%) stddev-sans-first:16239.36 14:19:37 INFO - PROCESS | 18736 | Values: 750.2 796.2 826.3 832.5 853.4 13030.7 13089.7 13248.4 13282.6 13350.0 12641.5 12720.0 12735.4 12736.4 12776.2 642.6 650.6 780.8 790.2 801.6 780.1 781.3 786.0 788.6 788.7 825.3 827.5 830.5 834.0 835.8 669.1 680.5 817.6 828.5 837.0 612.4 613.3 613.5 614.7 615.2 13384.7 13692.6 13704.5 13706.9 13710.0 11455.4 12477.1 12770.1 13166.5 13514.5 9825.9 9849.2 9904.6 10342.4 10417.6 3268.4 3320.5 3328.5 3352.2 3391.9 43596.8 43641.6 43878.0 44246.1 44272.8 9154.5 9262.6 9321.9 9411.6 9558.1 17052.2 17067.5 17069.1 17079.1 17091.4 7501.8 7521.5 7528.2 7675.0 7750.6 4181.3 4225.7 4261.7 4429.6 4589.3 2910.2 2951.4 2964.6 2977.3 2982.4 560.7 564.0 567.0 579.1 580.2 557.6 585.6 603.6 622.2 636.5 7869.4 7931.6 8123.1 8194.6 8362.8 615.3 624.1 626.0 629.2 662.0 3676.1 3853.3 3902.7 4016.0 4041.0 59820.0 60439.0 60603.0 60755.0 60898.7 51270.2 52342.7 52445.5 52454.2 52511.2 45683.8 46450.8 46906.8 47286.5 47295.8 7885.6 8279.0 8300.5 8343.7 8381.2 34970.0 35169.5 35300.3 35474.1 36075.5 45913.0 46803.0 47005.8 47061.8 47062.3 9797.6 9868.4 9988.0 10241.5 10366.3 10646.6 10773.9 11390.4 11509.6 11788.6 9967.1 10497.5 10517.9 10554.8 10796.8 9515.4 9712.3 9757.9 10032.3 10152.0 9605.3 9947.1 10636.8 10671.7 10857.0 8550.2 8594.6 8624.6 8742.3 8876.4 8373.0 8562.4 8686.2 8837.6 8839.0 14:19:37 INFO - PROCESS | 18736 | -------- Summary: end -------- 14:19:37 INFO - PROCESS | 18736 | 14:19:38 INFO - TEST-INFO | 18736: exit 0 14:19:38 INFO - TEST-OK | dromaeo_css | took 1112178ms 14:19:38 INFO - TEST-START | kraken 14:19:38 INFO - operating with platform_type : linux_ 14:19:38 INFO - Initialising browser for kraken test... 14:19:38 INFO - TEST-INFO | started process 18939 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpQKsQaE/profile http://localhost:54450/getInfo.html) 14:19:41 INFO - PROCESS | 18939 | __metrics Screen width/height:1600/1200 14:19:41 INFO - PROCESS | 18939 | colorDepth:24 14:19:41 INFO - PROCESS | 18939 | Browser inner width/height: 1024/697 14:19:41 INFO - PROCESS | 18939 | __metrics 14:19:41 INFO - PROCESS | 18939 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 14:19:42 INFO - PROCESS | 18939 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 14:19:42 INFO - PROCESS | 18939 | JavaScript error: resource://gre/modules/IndexedDBHelper.jsm, line 138: UnknownError: The operation failed for reasons unrelated to the database itself and not covered by any other error code. 14:19:42 INFO - TEST-INFO | 18939: exit 0 14:19:42 INFO - Browser initialized. 14:19:42 INFO - Running cycle 1/1 for kraken test... 14:19:42 INFO - TEST-INFO | started process 19022 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpQKsQaE/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:19:54 INFO - PROCESS | 19022 | RSS: Main: 145809408 14:19:54 INFO - PROCESS | 19022 | 14:19:57 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54450/tests/kraken/driver.html?testName=audio-beat-detection) 14:19:57 INFO - PROCESS | 19022 | RSS: Main: 184606720 14:19:57 INFO - PROCESS | 19022 | 14:20:00 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54450/tests/kraken/driver.html?testName=audio-dft) 14:20:00 INFO - PROCESS | 19022 | RSS: Main: 176197632 14:20:00 INFO - PROCESS | 19022 | 14:20:03 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54450/tests/kraken/driver.html?testName=audio-fft) 14:20:04 INFO - PROCESS | 19022 | RSS: Main: 159342592 14:20:04 INFO - PROCESS | 19022 | 14:20:06 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54450/tests/kraken/driver.html?testName=audio-oscillator) 14:20:07 INFO - PROCESS | 19022 | RSS: Main: 163815424 14:20:07 INFO - PROCESS | 19022 | 14:20:09 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54450/tests/kraken/driver.html?testName=imaging-gaussian-blur) 14:20:09 INFO - PROCESS | 19022 | RSS: Main: 164433920 14:20:09 INFO - PROCESS | 19022 | 14:20:12 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54450/tests/kraken/driver.html?testName=imaging-darkroom) 14:20:13 INFO - PROCESS | 19022 | RSS: Main: 164192256 14:20:13 INFO - PROCESS | 19022 | 14:20:16 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54450/tests/kraken/driver.html?testName=imaging-desaturate) 14:20:17 INFO - PROCESS | 19022 | RSS: Main: 164327424 14:20:17 INFO - PROCESS | 19022 | 14:20:20 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54450/tests/kraken/driver.html?testName=json-parse-financial) 14:20:20 INFO - PROCESS | 19022 | RSS: Main: 164478976 14:20:20 INFO - PROCESS | 19022 | 14:20:22 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54450/tests/kraken/driver.html?testName=json-stringify-tinderbox) 14:20:22 INFO - PROCESS | 19022 | RSS: Main: 178049024 14:20:22 INFO - PROCESS | 19022 | 14:20:24 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54450/tests/kraken/driver.html?testName=stanford-crypto-aes) 14:20:25 INFO - PROCESS | 19022 | RSS: Main: 177913856 14:20:25 INFO - PROCESS | 19022 | 14:20:27 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54450/tests/kraken/driver.html?testName=stanford-crypto-ccm) 14:20:27 INFO - PROCESS | 19022 | RSS: Main: 185769984 14:20:27 INFO - PROCESS | 19022 | 14:20:30 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54450/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 14:20:30 INFO - PROCESS | 19022 | RSS: Main: 192925696 14:20:30 INFO - PROCESS | 19022 | 14:20:33 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54450/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 14:20:33 INFO - PROCESS | 19022 | RSS: Main: 192712704 14:20:33 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | Cycle 1(1): loaded http://localhost:54450/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54450/tests/kraken/driver.html?testName=ai-astar) 14:20:35 INFO - PROCESS | 19022 | RSS: Main: 251854848 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | __start_tp_report 14:20:35 INFO - PROCESS | 19022 | _x_x_mozilla_page_load 14:20:35 INFO - PROCESS | 19022 | _x_x_mozilla_page_load_details 14:20:35 INFO - PROCESS | 19022 | |i|pagename|runs| 14:20:35 INFO - PROCESS | 19022 | |0;ai-astar;111;111;104;111;110;110;111;110;106;109 14:20:35 INFO - PROCESS | 19022 | |1;audio-beat-detection;163;128;152;171;125;147;148;129;165;129 14:20:35 INFO - PROCESS | 19022 | |2;audio-dft;161;160;162;160;161;160;159;161;161;160 14:20:35 INFO - PROCESS | 19022 | |3;audio-fft;75;73;96;97;73;73;75;117;94;75 14:20:35 INFO - PROCESS | 19022 | |4;audio-oscillator;100;96;145;96;96;95;143;97;96;142 14:20:35 INFO - PROCESS | 19022 | |5;imaging-gaussian-blur;109;109;109;109;109;110;109;109;109;109 14:20:35 INFO - PROCESS | 19022 | |6;imaging-darkroom;146;146;146;146;145;145;147;145;146;146 14:20:35 INFO - PROCESS | 19022 | |7;imaging-desaturate;96;95;95;96;96;95;96;96;96;96 14:20:35 INFO - PROCESS | 19022 | |8;json-parse-financial;59;57;56;57;56;57;57;56;56;54 14:20:35 INFO - PROCESS | 19022 | |9;json-stringify-tinderbox;66;68;66;66;67;67;66;68;66;67 14:20:35 INFO - PROCESS | 19022 | |10;stanford-crypto-aes;80;80;82;84;82;82;81;82;83;81 14:20:35 INFO - PROCESS | 19022 | |11;stanford-crypto-ccm;120;113;128;118;121;114;122;113;115;117 14:20:35 INFO - PROCESS | 19022 | |12;stanford-crypto-pbkdf2;145;143;143;145;142;132;145;150;142;143 14:20:35 INFO - PROCESS | 19022 | |13;stanford-crypto-sha256-iterative;66;69;69;68;66;66;65;68;66;65 14:20:35 INFO - PROCESS | 19022 | __end_tp_report 14:20:35 INFO - PROCESS | 19022 | __start_cc_report 14:20:35 INFO - PROCESS | 19022 | _x_x_mozilla_cycle_collect,941 14:20:35 INFO - PROCESS | 19022 | __end_cc_report 14:20:35 INFO - PROCESS | 19022 | __startTimestamp1453760435712__endTimestamp 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | ------- Summary: start ------- 14:20:35 INFO - PROCESS | 19022 | Number of tests: 14 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#0] ai-astar Cycles:10 Average:109.30 Median:110.50 stddev:2.41 (2.2%) stddev-sans-first:2.47 14:20:35 INFO - PROCESS | 19022 | Values: 111.0 111.0 104.0 111.0 110.0 110.0 111.0 110.0 106.0 109.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#1] audio-beat-detection Cycles:10 Average:145.70 Median:150.00 stddev:17.19 (11.5%) stddev-sans-first:17.05 14:20:35 INFO - PROCESS | 19022 | Values: 163.0 128.0 152.0 171.0 125.0 147.0 148.0 129.0 165.0 129.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#2] audio-dft Cycles:10 Average:160.50 Median:161.00 stddev:0.85 (0.5%) stddev-sans-first:0.88 14:20:35 INFO - PROCESS | 19022 | Values: 161.0 160.0 162.0 160.0 161.0 160.0 159.0 161.0 161.0 160.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#3] audio-fft Cycles:10 Average:84.80 Median:75.00 stddev:15.28 (20.4%) stddev-sans-first:15.79 14:20:35 INFO - PROCESS | 19022 | Values: 75.0 73.0 96.0 97.0 73.0 73.0 75.0 117.0 94.0 75.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#4] audio-oscillator Cycles:10 Average:110.60 Median:96.00 stddev:22.64 (23.6%) stddev-sans-first:23.68 14:20:35 INFO - PROCESS | 19022 | Values: 100.0 96.0 145.0 96.0 96.0 95.0 143.0 97.0 96.0 142.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#5] imaging-gaussian-blur Cycles:10 Average:109.10 Median:109.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 14:20:35 INFO - PROCESS | 19022 | Values: 109.0 109.0 109.0 109.0 109.0 110.0 109.0 109.0 109.0 109.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#6] imaging-darkroom Cycles:10 Average:145.80 Median:146.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 14:20:35 INFO - PROCESS | 19022 | Values: 146.0 146.0 146.0 146.0 145.0 145.0 147.0 145.0 146.0 146.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:96.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 14:20:35 INFO - PROCESS | 19022 | Values: 96.0 95.0 95.0 96.0 96.0 95.0 96.0 96.0 96.0 96.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#8] json-parse-financial Cycles:10 Average:56.50 Median:57.00 stddev:1.27 (2.2%) stddev-sans-first:0.97 14:20:35 INFO - PROCESS | 19022 | Values: 59.0 57.0 56.0 57.0 56.0 57.0 57.0 56.0 56.0 54.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#9] json-stringify-tinderbox Cycles:10 Average:66.70 Median:67.00 stddev:0.82 (1.2%) stddev-sans-first:0.83 14:20:35 INFO - PROCESS | 19022 | Values: 66.0 68.0 66.0 66.0 67.0 67.0 66.0 68.0 66.0 67.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#10] stanford-crypto-aes Cycles:10 Average:81.70 Median:82.00 stddev:1.25 (1.5%) stddev-sans-first:1.17 14:20:35 INFO - PROCESS | 19022 | Values: 80.0 80.0 82.0 84.0 82.0 82.0 81.0 82.0 83.0 81.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#11] stanford-crypto-ccm Cycles:10 Average:118.10 Median:119.00 stddev:4.77 (4.0%) stddev-sans-first:5.01 14:20:35 INFO - PROCESS | 19022 | Values: 120.0 113.0 128.0 118.0 121.0 114.0 122.0 113.0 115.0 117.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.00 Median:144.00 stddev:4.52 (3.1%) stddev-sans-first:4.74 14:20:35 INFO - PROCESS | 19022 | Values: 145.0 143.0 143.0 145.0 142.0 132.0 145.0 150.0 142.0 143.0 14:20:35 INFO - PROCESS | 19022 | 14:20:35 INFO - PROCESS | 19022 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.80 Median:67.00 stddev:1.55 (2.3%) stddev-sans-first:1.62 14:20:35 INFO - PROCESS | 19022 | Values: 66.0 69.0 69.0 68.0 66.0 66.0 65.0 68.0 66.0 65.0 14:20:35 INFO - PROCESS | 19022 | -------- Summary: end -------- 14:20:35 INFO - PROCESS | 19022 | 14:20:36 INFO - TEST-INFO | 19022: exit 0 14:20:36 INFO - TEST-OK | kraken | took 58438ms 14:20:36 INFO - TEST-START | v8_7 14:20:36 INFO - operating with platform_type : linux_ 14:20:36 INFO - Initialising browser for v8_7 test... 14:20:36 INFO - TEST-INFO | started process 19269 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpsoTk_r/profile http://localhost:54450/getInfo.html) 14:20:40 INFO - PROCESS | 19269 | __metrics Screen width/height:1600/1200 14:20:40 INFO - PROCESS | 19269 | colorDepth:24 14:20:40 INFO - PROCESS | 19269 | Browser inner width/height: 1024/697 14:20:40 INFO - PROCESS | 19269 | __metrics 14:20:40 INFO - PROCESS | 19269 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 14:20:40 INFO - PROCESS | 19269 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 14:20:41 INFO - TEST-INFO | 19269: exit 0 14:20:41 INFO - Browser initialized. 14:20:41 INFO - Running cycle 1/1 for v8_7 test... 14:20:41 INFO - TEST-INFO | started process 19349 (/builds/slave/test-pgo/build/application/firefox/firefox -profile /tmp/tmpsoTk_r/profile -tp file:/builds/slave/test-pgo/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 14:20:53 INFO - PROCESS | 19349 | RSS: Main: 149164032 14:20:53 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | Cycle 1(1): loaded http://localhost:54450/tests/v8_7/run.html (next: http://localhost:54450/tests/v8_7/run.html) 14:21:15 INFO - PROCESS | 19349 | RSS: Main: 530399232 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | __start_tp_report 14:21:15 INFO - PROCESS | 19349 | _x_x_mozilla_page_load 14:21:15 INFO - PROCESS | 19349 | _x_x_mozilla_page_load_details 14:21:15 INFO - PROCESS | 19349 | |i|pagename|runs| 14:21:15 INFO - PROCESS | 19349 | |0;Richards;167.58840288252054 14:21:15 INFO - PROCESS | 19349 | |1;DeltaBlue;190.5487804878049 14:21:15 INFO - PROCESS | 19349 | |2;Encrypt;279.4857462269424 14:21:15 INFO - PROCESS | 19349 | |3;Decrypt;5170.103092783505 14:21:15 INFO - PROCESS | 19349 | |4;RayTrace;1136.3636363636363 14:21:15 INFO - PROCESS | 19349 | |5;Earley;778.2101167315175 14:21:15 INFO - PROCESS | 19349 | |6;Boyer;12156.626506024097 14:21:15 INFO - PROCESS | 19349 | |7;RegExp;43234.04255319149 14:21:15 INFO - PROCESS | 19349 | |8;Splay;570.7762557077625 14:21:15 INFO - PROCESS | 19349 | |9;NavierStokes;4817.307692307692 14:21:15 INFO - PROCESS | 19349 | __end_tp_report 14:21:15 INFO - PROCESS | 19349 | __startTimestamp1453760475641__endTimestamp 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | ------- Summary: start ------- 14:21:15 INFO - PROCESS | 19349 | Number of tests: 10 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#0] Richards Cycles:1 Average:167.59 Median:167.59 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 167.6 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#1] DeltaBlue Cycles:1 Average:190.55 Median:190.55 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 190.5 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#2] Encrypt Cycles:1 Average:279.49 Median:279.49 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 279.5 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#3] Decrypt Cycles:1 Average:5170.10 Median:5170.10 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 5170.1 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#4] RayTrace Cycles:1 Average:1136.36 Median:1136.36 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 1136.4 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#5] Earley Cycles:1 Average:778.21 Median:778.21 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 778.2 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#6] Boyer Cycles:1 Average:12156.63 Median:12156.63 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 12156.6 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#7] RegExp Cycles:1 Average:43234.04 Median:43234.04 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 43234.0 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#8] Splay Cycles:1 Average:570.78 Median:570.78 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 570.8 14:21:15 INFO - PROCESS | 19349 | 14:21:15 INFO - PROCESS | 19349 | [#9] NavierStokes Cycles:1 Average:4817.31 Median:4817.31 stddev:0.00 (0.0%) 14:21:15 INFO - PROCESS | 19349 | Values: 4817.3 14:21:15 INFO - PROCESS | 19349 | -------- Summary: end -------- 14:21:15 INFO - PROCESS | 19349 | 14:21:16 INFO - TEST-INFO | 19349: exit 0 14:21:16 INFO - TEST-OK | v8_7 | took 39851ms 14:21:16 INFO - SUITE-END | took 1210s 14:21:16 INFO - Completed test suite (00:20:10) 14:21:16 INFO - Working with test: dromaeo_css 14:21:16 INFO - Generating results file: dromaeo_css 14:21:16 INFO - Working with test: kraken 14:21:16 INFO - Generating results file: kraken 14:21:16 INFO - javascript benchmark 14:21:16 INFO - Working with test: v8_7 14:21:16 INFO - Generating results file: v8_7 14:21:16 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 14:21:16 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,201,35]] 14:21:16 INFO - process_Request line: dromaeo_css 6663.22 graph.html#tests=[[72,201,35]] 14:21:16 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 14:21:16 INFO - process_Request line: kraken 1494.30 graph.html#tests=[[232,201,35]] 14:21:16 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 14:21:16 INFO - process_Request line: v8_7 20094.77 graph.html#tests=[[230,201,35]] 14:21:16 INFO - RETURN: dromaeo_css: 6663.22 14:21:16 INFO - RETURN: kraken: 1494.30 14:21:16 INFO - RETURN: v8_7: 20094.77 14:21:16 INFO - javascript benchmark 14:21:16 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3099.7055279748424, 3114.7508199344056, 3158.5735925650047, 3161.4783560712485, 3191.585093937788, 4984.277279794428, 5040.294358789773, 5057.721825299607, 5065.012322597095, 5079.161938280188, 5096.108181068316, 5098.031374038939, 5101.617378696594, 5110.846674599758, 5144.408393034792, 4640.907181856361, 4661.976690116553, 4721.740304283263, 4766.6901651392545, 4783.402074740658, 4727.149113159629, 4739.218029025206, 4757.881052973668, 4811.08589368019, 4821.879453013686, 4604.148232576984, 4613.677042607019, 4656.4645065817185, 4662.626989840838, 4670.556297151782, 4625.676202665814, 4647.0, 4669.463011753658, 4670.392848929651, 4684.508126646721, 4616.915024969129, 4628.699134556243, 4634.443866735979, 4666.2767271073035, 4702.882427939329, 4894.681845680019, 4899.902001959941, 4956.10790057793, 4963.70217786934, 4972.328735620681, 5376.865578360533, 5378.327709036371, 5379.112446446371, 5379.67721936685, 5426.968875913563, 5404.270423492818, 5404.756785944642, 5438.374586922515, 5463.0, 5481.725913704299, 5101.642884998052, 5119.948800511947, 5123.795048198068, 5124.846254612367, 5138.7687554059785, 5519.668819870821, 5522.585806064561, 5524.033294173503, 5526.0, 5551.0, 5228.398734145546, 5307.946920530745, 5328.067588172132, 5336.813211537577, 5339.759710813023, 5367.78528858849, 5418.051840927822, 5422.132458806572, 5440.91838622421, 5463.48096930791, 5438.619296649275, 5461.563074953994, 5462.918056229159, 5474.124140137638, 5510.090835012258, 5307.3896501902, 5391.05656510117, 5445.891082178334, 5452.427495113036, 5471.699056551848, 4279.679024073207, 4303.332983387518, 4306.0311429928015, 4315.395844581761, 4321.5678432157165, 3789.3558095123894, 3829.483019792348, 3842.4044273137706, 3867.1298957734284, 3894.162755007687, 5072.442031376546, 5072.746362681925, 5096.464871188472, 5102.642815002989, 5137.409197942285, 5475.260839786578, 5491.368492623399, 5493.533049690821, 5500.477454641803, 5517.751701173457, 5069.9746501267255, 5074.619403544749, 5084.542391184811, 5089.211172268304, 5117.334746483008, 4608.101420223024, 4667.369905062773, 4684.8360307389075, 4707.082118986765, 4751.667383283206, 5644.971775141098, 5655.4344565543115, 5667.688277144796, 5678.545716342683, 5685.971570142206, 5479.123340265538, 5502.367227768857, 5503.862403439946, 5512.448755124456, 5556.083246264321, 5533.6126471148245, 5536.916946245729, 5573.108302671553, 5633.88732225345, 5673.489385955284, 5400.648957817729, 5444.863878403072, 5459.508644222039, 5471.37079235893, 5473.753681084281, 5436.700981446058, 5488.204210389551, 5496.31296087989, 5504.779808807602, 5516.365617953987, 5319.707416092152, 5375.81184658535, 5376.220448034935, 5401.351837779492, 5427.918581221206, 5297.258383826191, 5352.785888564569, 5380.219868119023, 5404.243405923095, 5428.348598168245, 5145.099607568735, 5166.819161329336, 5172.663776854492, 5177.326947496801, 5213.973930130325, 5268.710220937885, 5299.655522391032, 5301.939612077523, 5303.867403314948, 5306.442823503631, 5148.871278218075, 5267.183586544092, 5303.071962406486, 5305.946940530545, 5326.920096198638], "unit": "score", "name": "dojo.html", "value": 5042.841862005258}, {"lowerIsBetter": false, "replicates": [515.5514702209078, 518.6162239942441, 521.3066621393547, 545.2339463054406, 552.8756029893274, 27847.30381740455, 28406.85796571017, 35355.64644353556, 35820.46269305963, 35933.82033089831, 37629.81185094077, 38145.42781858268, 38213.426798597975, 38306.0, 38338.0, 8364.498130112197, 8559.700410485635, 8560.400771945966, 8563.314934805201, 8563.700270490534, 8234.3412526998, 8394.160583941619, 8395.076541580422, 8399.0, 8399.034111077213, 8595.871061934076, 8683.435576687527, 8684.696035638754, 8686.522241276727, 8688.131186881325, 8524.78688032798, 8590.969083709932, 8608.956955215184, 8612.18184272493, 8616.784580385478, 8433.0, 8554.743357699217, 8574.571271436465, 8575.614097365633, 8579.52812595307, 38356.80821595874, 38923.0, 39064.414033789515, 39093.21813563741, 39098.21803563941, 3092.963857107849, 3124.7343975762087, 3298.5876765404323, 3496.6328535503662, 3527.6119626841282, 29313.267168320748, 30022.0, 30222.395552089056, 30398.84800576005, 30412.896236775392, 3630.709543236535, 3721.291401606793, 3888.844446222148, 3939.231849789292, 3983.581723918976, 270089.0, 270919.0, 271724.0, 271809.0, 273255.0, 50784.238236426485, 50978.490215098114, 55397.72301138468, 55831.72084139553, 55865.44134558603, 61056.38943610596, 62159.37840621627, 62290.68854655698, 62443.375566243754, 62460.687696561225, 12440.75118497643, 12658.936705316599, 12664.0, 12667.619971400873, 12679.873201267868, 8638.438501497383, 8874.334424918157, 8878.778030549158, 8879.644814207488, 9071.455712657262, 19408.360448076415, 19967.0, 19987.20051197965, 20059.197632094554, 20087.698684519743, 7603.391728661693, 7713.8457230855065, 7927.960360198277, 8017.719379821679, 8040.316573091352, 952.5094576293214, 1008.863803386548, 1032.339302846179, 1053.562771449855, 1115.7824224276187, 27969.160925172277, 28026.71973280282, 28142.15573532797, 28547.429051418854, 28627.14118576446, 1002.2983911262146, 1030.953607087668, 1047.1099565369375, 1069.1607088435542, 1098.5605757696985, 14667.559973200821, 14757.704845903236, 14848.851511484747, 15003.17482538449, 15027.323770430357, 318676.0, 327336.0, 327786.0, 327926.0, 327967.0, 51641.741791291555, 52026.0, 52034.739826300625, 52076.739616301675, 52169.0, 1320.7358528294187, 1324.6158614001831, 1349.069142291835, 1349.6490912362856, 1354.4582167133226, 27237.455250894476, 28263.15210543687, 28263.994945751365, 28364.432711345245, 28553.28616784597, 45385.319220211066, 45413.31880021869, 45678.77160614176, 45856.31215531703, 45907.0, 302328.0, 304271.0, 305194.0, 306645.0, 307467.0, 26927.461450771265, 27459.588106178024, 31409.685903140675, 31445.213869653442, 31578.842105789325, 36833.0, 37665.62334376621, 37726.81136594409, 38164.61835381722, 38199.2360152801, 31074.223144420666, 31868.8406557975, 32331.35337293194, 32630.347393051532, 32888.34223315568, 26392.0, 27785.583216252176, 27871.44257114887, 34925.82537087298, 38671.0, 33854.3229135411, 34418.48372274468, 34558.308833823685, 34992.65007349894, 35103.47344789779, 27610.0, 29055.854720727108, 29681.406371872872, 30869.831348564083, 32014.35971280608, 23121.421964451023, 23247.41881452977, 23324.53350932938, 24476.75523244745, 24688.658523253063], "unit": "score", "name": "ext.html", "value": 17668.23084427321}, {"lowerIsBetter": false, "replicates": [358.2137208826626, 358.9533360663115, 359.06284597201306, 359.91182160370715, 360.320795300858, 13639.863601363983, 14135.363908624111, 15705.921470392646, 16223.75664365034, 17160.05619690915, 14572.0, 15183.16492592907, 15622.609434764137, 15737.921310393433, 15893.52319430416, 5261.158214685661, 5517.586181036419, 5544.3346798384255, 5546.334439867222, 5549.417311182328, 4042.3532234842432, 4166.0, 5402.756875940572, 5516.0, 5816.33112192097, 5888.97055514724, 5962.25471816023, 5988.610740301889, 6001.279846418436, 6002.159697642333, 4904.779284932169, 5025.623078269126, 5045.192769156917, 5078.31442755227, 5084.186530155157, 4819.903601927942, 4851.393575803025, 5018.924716129261, 5019.121653710586, 5021.497850214986, 11469.0, 11484.368359740294, 17200.569985750455, 20062.699059514118, 20066.598668026705, 1994.4415563642203, 2003.2387692676834, 2013.134352228541, 2020.121247257433, 2066.2561477867957, 6108.602940808878, 7411.0736157980255, 9034.277257819358, 9257.074292570689, 9400.059994000614, 1854.8979806110658, 1860.8790428622096, 1874.2690350763214, 1876.3901731937176, 1884.9434516964513, 54698.90602187974, 55415.168772468445, 56512.0, 56616.716916415564, 57207.0, 9197.770055748526, 9422.152006319464, 9485.478298693639, 9487.715368538955, 9613.0, 13038.608841734764, 13084.214947103204, 13090.0, 13104.344782760823, 13108.147970382086, 6230.937690623126, 6579.736810527525, 6613.338666133444, 6632.734690612321, 6685.966570167216, 6241.063840423973, 6274.278457977391, 6289.308176100625, 6295.18162638854, 6303.936960630427, 3888.6889048876587, 3912.941305880414, 4027.7583344999393, 4039.0, 4049.8380064797666, 1646.4233474612195, 1705.8891172073775, 1749.2915369275463, 1788.043396782715, 1818.809025052377, 897.7351681254046, 917.866909298148, 924.4915296586851, 929.3355250995571, 987.4124895687055, 14612.050216735877, 15512.379504819906, 15845.52463426099, 16410.17949102564, 16720.665586688443, 870.6734974384606, 901.4906577783531, 906.3202598051462, 920.7882187097006, 933.0715937641954, 7405.0, 9151.862722059175, 9203.723888283363, 9340.813183736287, 9424.575894084646, 362406.0, 488958.0, 548783.0, 591702.0, 593271.0, 46066.30900536494, 55560.16659750107, 68081.3191868075, 71279.2872071283, 72378.0, 1090.650991682654, 1113.5768408004906, 1114.4427786106946, 1115.570505355444, 1134.5802053240188, 15027.474038408604, 15056.698866022838, 15165.393384264948, 15226.77159842581, 15495.922520387327, 32826.50760238646, 33381.66618333785, 33470.0, 33680.0, 33847.49228761521, 43432.34851477167, 43733.34399983939, 43824.780876095414, 44159.0, 46783.29825052695, 6600.636964966973, 6665.50008749336, 6781.796546103427, 6880.174379074543, 7165.211826698955, 7753.534787912743, 8225.83548329018, 10338.328008679411, 11014.339139651647, 11046.889531104585, 9053.0, 9125.589348479201, 9461.95269023678, 9611.855822162814, 9690.273229507675, 9711.973577205272, 9766.75583110428, 9836.754081147743, 10359.22305827081, 10380.169586433218, 7017.175639276505, 9083.68207112748, 9138.17756401927, 9893.505324733878, 10113.747156321151, 7081.539699919489, 7084.574925504487, 7100.857982840417, 7128.928710712827, 7198.136223653195, 7596.658150383357, 9811.067948544876, 9825.312228143961, 9912.801743964936, 10256.179505639382], "unit": "score", "name": "jquery.html", "value": 7792.379513513474}, {"lowerIsBetter": false, "replicates": [1327.3960348041642, 1463.7584798508246, 1481.03732573827, 1643.9178041097941, 1801.6306657135297, 7134.357907788298, 7746.92253077469, 7887.0, 7887.566183859885, 7900.32847207988, 7675.961620191905, 7865.528068315891, 7873.0, 7880.0, 7884.448088633798, 2019.61627290815, 2065.1326442893946, 2260.638297872341, 2320.3619004773655, 2347.3896786835376, 2285.268714011517, 2305.6310990241564, 2318.733345665253, 2321.3616255529696, 2323.570139524185, 2228.43174990378, 2301.5627030864084, 2304.493011537459, 2307.377008207783, 2309.445733024079, 2277.5103352779147, 2289.461976435536, 2330.07961855068, 2335.859848409101, 2340.566995105911, 2277.055022165799, 2277.8633282003134, 2293.392251053472, 2298.8965496552696, 2321.025169428844, 7321.487495875291, 7388.0, 7388.150362708304, 7389.076365454318, 7391.519551229153, 4666.626669866402, 4774.522547745232, 4816.133096042711, 4818.277258411232, 4820.060088282787, 2999.8302359720005, 3019.531972544259, 3062.0, 3072.6159230096237, 3092.8762849485993, 938.7183844846587, 953.9666111686058, 971.8930917599058, 974.8099120671401, 995.7908839143788, 10505.054545090901, 10735.355878647306, 10739.24825262232, 10763.569457221702, 10785.13718902486, 4067.1662309226535, 4099.754014759124, 4159.147374788161, 4175.185838761473, 4181.686373521998, 9158.0, 9160.6793762218, 9181.127792859668, 9183.58673859678, 9189.816203676022, 4631.374764406829, 4649.442066951988, 4651.3720647712125, 4654.557817007379, 4664.207084795593, 4211.7262377945335, 4216.9578304217175, 4221.176870510221, 4221.409002739619, 4227.048913994388, 3461.238527523941, 3489.4416893296952, 3494.2138018946043, 3496.2483066140394, 3553.7867727936405, 1159.8898104680043, 1165.597868735285, 1173.184636677501, 1177.5584155941522, 1182.722060315825, 998.3710262534556, 1021.1779517488493, 1022.3303736052898, 1130.361345839598, 1329.1759109352263, 7010.053642758265, 7092.078029856086, 7115.964420177866, 7135.250798666066, 7143.82140446493, 1062.9309094908806, 1074.5379486820586, 1082.1883587309517, 1098.1324753444849, 1102.525913857049, 5712.657240565496, 5738.340090889517, 5815.709214539256, 5830.5044071254415, 5905.320888097924, 9400.858987115198, 9759.756006099904, 9769.0, 9887.505624718735, 9943.25425593069, 9442.763930901783, 9644.083812037845, 9698.46658433793, 9720.416774993522, 9884.802303954024, 7412.925870741331, 7500.887486687704, 7501.962490187623, 7505.0, 7508.962455187799, 7280.563166210044, 7337.523061001018, 7382.630868456448, 7386.482946193715, 7401.111866576045, 8623.396362254833, 8675.956620216859, 8716.477011379338, 8734.0, 8747.0, 8866.290696744116, 8888.0, 8936.553172341228, 9129.315301352291, 9139.405938613969, 7148.28517148281, 7148.606826624377, 7175.0, 7220.133583969957, 7226.241244669234, 6167.259928808572, 6302.968485157545, 7565.205653406313, 7614.200508946702, 7719.6140192989005, 6922.342377474132, 6926.238113807578, 6971.058907047686, 7016.5088443808445, 7253.310935461122, 6824.351686589766, 6930.48021398387, 6982.720691172296, 7069.363757261871, 7123.145222573325, 6987.301269872972, 7017.929820701727, 7039.19049309336, 7041.014258003781, 7043.6830342633675, 6572.868542629216, 6605.702743376656, 6636.502262330441, 6640.83397915056, 6748.122744043243, 6556.2788093308745, 6600.108985287116, 6603.80188594343, 6608.537402381787, 6610.8347291318105], "unit": "score", "name": "mootools.html", "value": 4489.405677640533}, {"lowerIsBetter": false, "replicates": [314.9401613693398, 322.6434789557539, 326.07882731284116, 328.3941128617702, 334.56673607678067, 5759.68321742304, 5778.104393818954, 5785.0, 5802.419758024201, 5810.854728631776, 5543.445655434464, 5556.972215138929, 5666.065099258617, 5694.829155125353, 5724.34170070442, 4436.0, 4443.755593442367, 4450.109978004396, 4454.599086082252, 4472.731636101828, 4235.364695295715, 4449.377087207794, 4454.510003899569, 4454.5545445455355, 4461.795315264877, 4279.7860106994685, 4314.568543145691, 4416.911661766762, 4428.202923473774, 4435.578620031092, 4388.319810429389, 4413.271810151337, 4419.381286619876, 4422.447194100738, 4434.955650443519, 3892.3188442022533, 3905.297046531623, 3908.042529580271, 3916.6475017248586, 3918.5101862267215, 5449.373322067933, 5461.317335333083, 5463.426340234298, 5468.890622187574, 5478.123500239983, 4874.829380971649, 4985.102681517362, 4992.975035124838, 4999.075171093359, 5032.968241510518, 5977.940220597782, 5983.940160598382, 5984.910226346608, 5986.401359864022, 5987.820365389001, 4216.810243539048, 4219.641330486912, 4222.1766755482695, 4222.619964203236, 4223.155368926227, 6159.076138579204, 6303.086052522359, 6380.904286435707, 6390.0734393512685, 6396.200474940632, 4344.087741574304, 4349.151915376535, 4350.216960946997, 4350.238708226111, 4351.97824010878, 4357.54245804186, 4392.099619577979, 4394.604485596312, 4401.977990110029, 4407.0524837160165, 5085.4914508548845, 5088.542031217208, 5096.949030509648, 5100.413452452941, 5107.387113546324, 5989.8203053908455, 6110.877782444326, 6120.969395152996, 6160.322364539897, 6172.382761723792, 1530.9234538273042, 1538.692261547695, 1543.8378970207966, 1559.235974372572, 1561.5783738390571, 1023.7338292044122, 1034.632705389591, 1036.9429681367596, 1055.0978913029248, 1058.0424715632364, 5826.388229235869, 5867.031939729982, 5872.2366092408565, 5877.0, 5880.147378630075, 6316.463100636405, 6321.494280457552, 6322.683865806691, 6323.20959880015, 6325.0, 5674.77300907959, 5736.913946290809, 5826.300843898674, 5919.437653422918, 5920.171176035358, 3409.4715319125576, 3417.641147679458, 3426.588809342895, 3429.4684323929832, 3434.8797792077157, 6613.272540020594, 6618.172728408949, 6619.238787539398, 6620.0, 6622.8013159604325, 6363.713632886531, 6525.575837570543, 6545.541812073109, 6545.607263564201, 6619.139511863427, 6637.269900310962, 6639.900401493981, 6645.435138013227, 6646.0, 6652.900206496906, 6387.329330420424, 6400.199975003125, 6410.294867564658, 6415.069814876723, 6424.678766061772, 6095.542834287535, 6265.0, 6312.4634406076, 6333.778317758856, 6345.7144428499905, 6611.735530578723, 6613.14029176204, 6621.966890165519, 6623.0, 6625.834354141185, 4294.463192100988, 4313.633341165911, 4319.265724826724, 4328.870133895988, 4331.501877284027, 6284.622922624657, 6407.711652975534, 6409.8718025640155, 6414.390632889868, 6421.646809425526, 6223.3465486125115, 6226.097215903578, 6226.844328891632, 6235.0, 6235.127082208585, 6192.318844926965, 6204.069389591597, 6204.720787564661, 6212.875742485216, 6222.0, 5922.1412895130825, 6059.454649081604, 6062.090686397076, 6071.058985857199, 6078.635281883101, 6198.2252218472695, 6240.594361366497, 6241.3134555197985, 6245.156903817927, 6247.781327653511, 6098.603590766586, 6108.175396321618, 6114.144019837137, 6122.326544080059, 6131.877362452637], "unit": "score", "name": "prototype.html", "value": 4629.16795967404}, {"lowerIsBetter": false, "replicates": [750.1860481377706, 796.2077732656008, 826.277007618334, 832.5337810825937, 853.4282031039207, 13030.73938521229, 13089.67275818104, 13248.403821828017, 13282.601521954333, 13350.0, 12641.49434022638, 12720.0, 12735.363231838417, 12736.363181840918, 12776.16954897931, 642.604798049201, 650.622638869457, 780.8047988003, 790.158481217503, 801.5911884938694, 780.0678189563474, 781.2617076862367, 785.9724909628164, 788.6490511722286, 788.73577351587, 825.3026192867047, 827.5159031966307, 830.4726498673356, 834.0283569641391, 835.7534527314457, 669.1267895396505, 680.4930326906461, 817.5748610722451, 828.5194587139445, 836.9916300836975, 612.4304396910871, 613.3284053960906, 613.5061275673081, 614.6772944204283, 615.1695211464532, 13384.732305353838, 13692.589222323246, 13704.45182192711, 13706.93146534271, 13710.0, 11455.369954652491, 12477.126601137925, 12770.106092573524, 13166.53917112906, 13514.459421623222, 9825.90174098257, 9849.21206303494, 9904.55429505674, 10342.37945723259, 10417.60395109129, 3268.4116858965376, 3320.49092425626, 3328.5340052392685, 3352.1787162145188, 3391.8982430527126, 43596.78201609004, 43641.56358436407, 43877.99999999968, 44246.11507769859, 44272.77863610661, 9154.542272886329, 9262.629494820267, 9321.906780932239, 9411.576479058458, 9558.091981261769, 17052.2326495308, 17067.48797536076, 17069.146542672817, 17079.146042697816, 17091.401800937158, 7501.821913529805, 7521.473496855277, 7528.209537998541, 7674.961625191839, 7750.573718445539, 4181.289180839264, 4225.704200705983, 4261.74429534229, 4429.579189976947, 4589.311603259471, 2910.2287893708185, 2951.3507028453705, 2964.6294213223346, 2977.2705687106363, 2982.41842840644, 560.7252446301364, 564.0383146734807, 567.044529967007, 579.1428685545417, 580.1993249315917, 557.5623135838348, 585.6017907822636, 603.5925750118653, 622.2129006806393, 636.522608043967, 7869.370450364072, 7931.56376399292, 8123.106458289583, 8194.631241594143, 8362.79093022667, 615.3047056825848, 624.0576729139033, 625.968701564929, 629.150646627059, 661.9871596457427, 3676.1361080146144, 3853.2678791029616, 3902.726809123391, 4015.9799201003807, 4040.959590404117, 59820.0, 60439.0, 60603.0, 60755.0, 60898.695506522185, 51270.230946535834, 52342.738286308326, 52445.47554524482, 52454.213186802226, 52511.212331815055, 45683.77158114188, 46450.76774616173, 46906.82732931636, 47286.52713472821, 47295.763521182176, 7885.5662938538935, 8279.0, 8300.543470109202, 8343.707970221014, 8381.245687888118, 34969.950901473, 35169.47245791264, 35300.29399412049, 35474.11314717153, 36075.458868116475, 45913.0, 46803.0, 47005.764971174925, 47061.76469117632, 47062.294065589726, 9797.55910983993, 9868.358556693793, 9987.950060249652, 10241.539130739284, 10366.326188797704, 10646.627368042082, 10773.946130269298, 11390.430478475877, 11509.597164099216, 11788.646340609796, 9967.10296073357, 10497.47512624381, 10517.94820517942, 10554.788904222027, 10796.838047429137, 9515.429074255568, 9712.3201375903, 9757.902420975699, 10032.347897386646, 10152.0, 9605.279604029585, 9947.05502977216, 10636.84044739314, 10671.733206669895, 10857.0, 8550.187732165434, 8594.570271486276, 8624.568771561522, 8742.256908162622, 8876.378653494194, 8372.958135209285, 8562.357823163164, 8686.218240358397, 8837.602307896032, 8838.955805220932], "unit": "score", "name": "yui.html", "value": 6065.063563752962}], "name": "dromaeo_css", "value": 6663.215547158379}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 111.0, 104.0, 111.0, 110.0, 110.0, 111.0, 110.0, 106.0, 109.0], "unit": "score", "name": "ai-astar", "value": 109.3}, {"lowerIsBetter": true, "replicates": [163.0, 128.0, 152.0, 171.0, 125.0, 147.0, 148.0, 129.0, 165.0, 129.0], "unit": "score", "name": "audio-beat-detection", "value": 145.7}, {"lowerIsBetter": true, "replicates": [161.0, 160.0, 162.0, 160.0, 161.0, 160.0, 159.0, 161.0, 161.0, 160.0], "unit": "score", "name": "audio-dft", "value": 160.5}, {"lowerIsBetter": true, "replicates": [75.0, 73.0, 96.0, 97.0, 73.0, 73.0, 75.0, 117.0, 94.0, 75.0], "unit": "score", "name": "audio-fft", "value": 84.8}, {"lowerIsBetter": true, "replicates": [100.0, 96.0, 145.0, 96.0, 96.0, 95.0, 143.0, 97.0, 96.0, 142.0], "unit": "score", "name": "audio-oscillator", "value": 110.6}, {"lowerIsBetter": true, "replicates": [109.0, 109.0, 109.0, 109.0, 109.0, 110.0, 109.0, 109.0, 109.0, 109.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.1}, {"lowerIsBetter": true, "replicates": [146.0, 146.0, 146.0, 146.0, 145.0, 145.0, 147.0, 145.0, 146.0, 146.0], "unit": "score", "name": "imaging-darkroom", "value": 145.8}, {"lowerIsBetter": true, "replicates": [96.0, 95.0, 95.0, 96.0, 96.0, 95.0, 96.0, 96.0, 96.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 95.7}, {"lowerIsBetter": true, "replicates": [59.0, 57.0, 56.0, 57.0, 56.0, 57.0, 57.0, 56.0, 56.0, 54.0], "unit": "score", "name": "json-parse-financial", "value": 56.5}, {"lowerIsBetter": true, "replicates": [66.0, 68.0, 66.0, 66.0, 67.0, 67.0, 66.0, 68.0, 66.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 66.7}, {"lowerIsBetter": true, "replicates": [80.0, 80.0, 82.0, 84.0, 82.0, 82.0, 81.0, 82.0, 83.0, 81.0], "unit": "score", "name": "stanford-crypto-aes", "value": 81.7}, {"lowerIsBetter": true, "replicates": [120.0, 113.0, 128.0, 118.0, 121.0, 114.0, 122.0, 113.0, 115.0, 117.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 118.1}, {"lowerIsBetter": true, "replicates": [145.0, 143.0, 143.0, 145.0, 142.0, 132.0, 145.0, 150.0, 142.0, 143.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 143.0}, {"lowerIsBetter": true, "replicates": [66.0, 69.0, 69.0, 68.0, 66.0, 66.0, 65.0, 68.0, 66.0, 65.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.8}], "name": "kraken", "value": 1494.3}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.58840288252054], "unit": "score", "name": "Richards", "value": 210.64703400000002}, {"lowerIsBetter": false, "replicates": [190.5487804878049], "unit": "score", "name": "DeltaBlue", "value": 346.9872640000001}, {"lowerIsBetter": false, "replicates": [279.4857462269424], "unit": "score", "name": "Encrypt", "value": 952.3956179999999}, {"lowerIsBetter": false, "replicates": [5170.103092783505], "unit": "score", "name": "Decrypt", "value": 51.48466001994015}, {"lowerIsBetter": false, "replicates": [1136.3636363636363], "unit": "score", "name": "RayTrace", "value": 651.1903200000003}, {"lowerIsBetter": false, "replicates": [778.2101167315175], "unit": "score", "name": "Earley", "value": 856.4049549999997}, {"lowerIsBetter": false, "replicates": [12156.626506024097], "unit": "score", "name": "Boyer", "value": 54.82302180376615}, {"lowerIsBetter": false, "replicates": [43234.04255319149], "unit": "score", "name": "RegExp", "value": 21.071011318897654}, {"lowerIsBetter": false, "replicates": [570.7762557077625], "unit": "score", "name": "Splay", "value": 142.77223200000006}, {"lowerIsBetter": false, "replicates": [4817.307692307692], "unit": "score", "name": "NavierStokes", "value": 308.055888223553}], "name": "v8_7", "value": 20094.769596270817}]} 14:21:16 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,201,35]]", "result": "20094.77"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,201,35]]", "result": "1494.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,201,35]]", "result": "6663.22"}}} 14:21:16 INFO - Return code: 0 14:21:16 INFO - Validating PERFHERDER_DATA against /builds/slave/test-pgo/build/tests/talos/treeherder-schemas/performance-artifact.json 14:21:16 INFO - # TBPL SUCCESS # 14:21:16 INFO - Running post-action listener: _resource_record_post_action 14:21:16 INFO - Running post-run listener: _resource_record_post_run 14:21:18 INFO - Total resource usage - Wall time: 1228s; CPU: 13.0%; Read bytes: 0; Write bytes: 547790848; Read time: 0; Write time: 490216 14:21:18 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 244576256; Read time: 0; Write time: 287892 14:21:18 INFO - run-tests - Wall time: 1212s; CPU: 13.0%; Read bytes: 0; Write bytes: 302616576; Read time: 0; Write time: 202324 14:21:18 INFO - Running post-run listener: _upload_blobber_files 14:21:18 INFO - Blob upload gear active. 14:21:18 INFO - Preparing to upload files from /builds/slave/test-pgo/build/blobber_upload_dir. 14:21:18 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 14:21:18 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', 'B2G-Inbound', '-d', '/builds/slave/test-pgo/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test-pgo/build/uploaded_files.json'] 14:21:18 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 B2G-Inbound -d /builds/slave/test-pgo/build/blobber_upload_dir --output-manifest /builds/slave/test-pgo/build/uploaded_files.json 14:21:18 INFO - (blobuploader) - INFO - Open directory for files ... 14:21:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 14:21:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:21:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:21:19 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 14:21:19 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:21:19 INFO - (blobuploader) - INFO - Done attempting. 14:21:19 INFO - (blobuploader) - INFO - Uploading /builds/slave/test-pgo/build/blobber_upload_dir/dromaeojs_raw.log ... 14:21:19 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 14:21:19 INFO - (blobuploader) - INFO - Uploading, attempt #1. 14:21:20 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 14:21:20 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 14:21:20 INFO - (blobuploader) - INFO - Done attempting. 14:21:20 INFO - (blobuploader) - INFO - Iteration through files over. 14:21:20 INFO - Return code: 0 14:21:20 INFO - rmtree: /builds/slave/test-pgo/build/uploaded_files.json 14:21:20 INFO - retry: Calling remove with args: ('/builds/slave/test-pgo/build/uploaded_files.json',), kwargs: {}, attempt #1 14:21:20 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/0eede408dd256d8c7fd65c9045fdf857476eeec05b4c2f618b87bfa7c82d7759086c6194428f855e62e7a4237440a9221a73560639a3ee26521ba2ee00b8424b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/aeedd8cdeb8007c82232e6e1e7d975ab02dd21cbf818f333c3c5cb8199e6f47f9e990618a28ca7effb6a1ca230c40fd598f08ff46352a4f145c1dec2eb26a478"} 14:21:20 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test-pgo/properties/blobber_files 14:21:20 INFO - Writing to file /builds/slave/test-pgo/properties/blobber_files 14:21:20 INFO - Contents: 14:21:20 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/0eede408dd256d8c7fd65c9045fdf857476eeec05b4c2f618b87bfa7c82d7759086c6194428f855e62e7a4237440a9221a73560639a3ee26521ba2ee00b8424b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/aeedd8cdeb8007c82232e6e1e7d975ab02dd21cbf818f333c3c5cb8199e6f47f9e990618a28ca7effb6a1ca230c40fd598f08ff46352a4f145c1dec2eb26a478"} 14:21:20 INFO - Running post-run listener: copy_logs_to_upload_dir 14:21:20 INFO - Copying logs to upload dir... 14:21:20 INFO - mkdir: /builds/slave/test-pgo/build/upload/logs 14:21:20 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1267.034503 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 7 secs) (at 2016-01-25 14:21:20.351927) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-25 14:21:20.355871) ========= 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=6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/0eede408dd256d8c7fd65c9045fdf857476eeec05b4c2f618b87bfa7c82d7759086c6194428f855e62e7a4237440a9221a73560639a3ee26521ba2ee00b8424b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/aeedd8cdeb8007c82232e6e1e7d975ab02dd21cbf818f333c3c5cb8199e6f47f9e990618a28ca7effb6a1ca230c40fd598f08ff46352a4f145c1dec2eb26a478"} build_url:https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011290 build_url: 'https://queue.taskcluster.net/v1/task/al5ogS_kQn-sU9KfgEa_rw/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/0eede408dd256d8c7fd65c9045fdf857476eeec05b4c2f618b87bfa7c82d7759086c6194428f855e62e7a4237440a9221a73560639a3ee26521ba2ee00b8424b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/B2G-Inbound/sha512/aeedd8cdeb8007c82232e6e1e7d975ab02dd21cbf818f333c3c5cb8199e6f47f9e990618a28ca7effb6a1ca230c40fd598f08ff46352a4f145c1dec2eb26a478"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-25 14:21:20.380352) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:21:20.380672) ========= 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=6dbc10da6d83fee962c624be000001a8-1453758984.368505-22293109 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004539 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-25 14:21:20.464143) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-25 14:21:20.464460) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-25 14:21:20.464751) ========= ========= Total master_lag: 0.28 =========